builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-053 starttime: 1460042363.25 results: success (0) buildid: 20160407053754 builduid: 491d7d113d9647989a0a0063ff4bd9ff revision: 6adef622c36b1ff4d388e1199f1ee328651ac616 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.248908) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.249428) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.249768) ========= bash -c pwd in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006172 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.273388) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.273742) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.287277) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.287687) ========= rm -rf properties in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004574 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.337638) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.338034) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.338504) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.338857) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-07 08:19:24-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 86.2K=0.1s 2016-04-07 08:19:24 (86.2 KB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.228409 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.583341) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.584114) ========= rm -rf scripts in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016158 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:23.637718) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-07 08:19:23.638563) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 6adef622c36b1ff4d388e1199f1ee328651ac616 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 6adef622c36b1ff4d388e1199f1ee328651ac616 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-07 08:19:24,546 truncating revision to first 12 chars 2016-04-07 08:19:24,546 Setting DEBUG logging. 2016-04-07 08:19:24,546 attempt 1/10 2016-04-07 08:19:24,546 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/6adef622c36b?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-07 08:19:25,584 unpacking tar archive at: mozilla-aurora-6adef622c36b/testing/mozharness/ program finished with exit code 0 elapsedTime=1.306757 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-07 08:19:24.963066) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:24.963897) ========= echo 6adef622c36b1ff4d388e1199f1ee328651ac616 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'6adef622c36b1ff4d388e1199f1ee328651ac616'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 6adef622c36b1ff4d388e1199f1ee328651ac616 program finished with exit code 0 elapsedTime=0.004746 script_repo_revision: '6adef622c36b1ff4d388e1199f1ee328651ac616' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:25.017768) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:25.018080) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-07 08:19:25.028607) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 26 secs) (at 2016-04-07 08:19:25.029169) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:19:26 INFO - MultiFileLogger online at 20160407 08:19:26 in /builds/slave/test-pgo 08:19:26 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 08:19:26 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 08:19:26 INFO - {'append_to_log': False, 08:19:26 INFO - 'base_work_dir': '/builds/slave/test-pgo', 08:19:26 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:19:26 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 08:19:26 INFO - 'branch': 'Mozilla-Aurora', 08:19:26 INFO - 'buildbot_json_path': 'buildprops.json', 08:19:26 INFO - 'config_files': ('talos/linux_config.py',), 08:19:26 INFO - 'default_actions': ('clobber', 08:19:26 INFO - 'read-buildbot-config', 08:19:26 INFO - 'download-and-extract', 08:19:26 INFO - 'populate-webroot', 08:19:26 INFO - 'create-virtualenv', 08:19:26 INFO - 'install', 08:19:26 INFO - 'run-tests'), 08:19:26 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:19:26 INFO - 'download_minidump_stackwalk': True, 08:19:26 INFO - 'download_symbols': 'ondemand', 08:19:26 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:19:26 INFO - 'tooltool.py': '/tools/tooltool.py', 08:19:26 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:19:26 INFO - '/tools/misc-python/virtualenv.py')}, 08:19:26 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:19:26 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:19:26 INFO - 'installer_path': 'installer.exe', 08:19:26 INFO - 'log_level': 'info', 08:19:26 INFO - 'log_name': 'talos', 08:19:26 INFO - 'log_to_console': True, 08:19:26 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:19:26 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:19:26 INFO - 'opt_config_files': (), 08:19:26 INFO - 'pip_index': False, 08:19:26 INFO - 'sps_profile': False, 08:19:26 INFO - 'sps_profile_interval': 0, 08:19:26 INFO - 'suite': 'dromaeojs', 08:19:26 INFO - 'system_bits': '32', 08:19:26 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:19:26 INFO - 'title': 'talos-linux64-ix-053', 08:19:26 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:19:26 INFO - 'use_talos_json': True, 08:19:26 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 08:19:26 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:19:26 INFO - 'work_dir': 'build'} 08:19:26 INFO - ##### 08:19:26 INFO - ##### Running clobber step. 08:19:26 INFO - ##### 08:19:26 INFO - Running pre-action listener: _resource_record_pre_action 08:19:26 INFO - Running main action method: clobber 08:19:26 INFO - rmtree: /builds/slave/test-pgo/build 08:19:26 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 08:19:26 INFO - Running post-action listener: _resource_record_post_action 08:19:26 INFO - ##### 08:19:26 INFO - ##### Running read-buildbot-config step. 08:19:26 INFO - ##### 08:19:26 INFO - Running pre-action listener: _resource_record_pre_action 08:19:26 INFO - Running main action method: read_buildbot_config 08:19:26 INFO - Using buildbot properties: 08:19:26 INFO - { 08:19:26 INFO - "project": "", 08:19:26 INFO - "product": "firefox", 08:19:26 INFO - "script_repo_revision": "production", 08:19:26 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 08:19:26 INFO - "repository": "", 08:19:26 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 08:19:26 INFO - "buildid": "20160407053754", 08:19:26 INFO - "pgo_build": "True", 08:19:26 INFO - "basedir": "/builds/slave/test-pgo", 08:19:26 INFO - "buildnumber": 263, 08:19:26 INFO - "slavename": "talos-linux64-ix-053", 08:19:26 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:19:26 INFO - "platform": "ubuntu64_hw", 08:19:26 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 08:19:26 INFO - "branch": "mozilla-aurora", 08:19:26 INFO - "repo_path": "releases/mozilla-aurora", 08:19:26 INFO - "revision": "6adef622c36b1ff4d388e1199f1ee328651ac616", 08:19:26 INFO - "stage_platform": "linux64-pgo", 08:19:26 INFO - "builduid": "491d7d113d9647989a0a0063ff4bd9ff", 08:19:26 INFO - "slavebuilddir": "test" 08:19:26 INFO - } 08:19:26 INFO - Found installer url https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2. 08:19:26 INFO - Running post-action listener: _resource_record_post_action 08:19:26 INFO - ##### 08:19:26 INFO - ##### Running download-and-extract step. 08:19:26 INFO - ##### 08:19:26 INFO - Running pre-action listener: _resource_record_pre_action 08:19:26 INFO - Running main action method: download_and_extract 08:19:26 INFO - mkdir: /builds/slave/test-pgo/build/tests 08:19:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:26 INFO - https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 08:19:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 08:19:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 08:19:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 08:19:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 08:19:27 INFO - Downloaded 1448 bytes. 08:19:27 INFO - Reading from file /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 08:19:27 INFO - Using the following test package requirements: 08:19:27 INFO - {u'common': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 08:19:27 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:19:27 INFO - u'firefox-47.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 08:19:27 INFO - u'gtest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:19:27 INFO - u'firefox-47.0a2.en-US.linux-x86_64.gtest.tests.zip'], 08:19:27 INFO - u'jittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:19:27 INFO - u'jsshell-linux-x86_64.zip'], 08:19:27 INFO - u'mochitest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:19:27 INFO - u'firefox-47.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 08:19:27 INFO - u'mozbase': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 08:19:27 INFO - u'reftest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:19:27 INFO - u'firefox-47.0a2.en-US.linux-x86_64.reftest.tests.zip'], 08:19:27 INFO - u'talos': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:19:27 INFO - u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'], 08:19:27 INFO - u'web-platform': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:19:27 INFO - u'firefox-47.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 08:19:27 INFO - u'webapprt': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 08:19:27 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:19:27 INFO - u'firefox-47.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 08:19:27 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:19:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:27 INFO - https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:19:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:19:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:19:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:19:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:19:28 INFO - Downloaded 23345382 bytes. 08:19:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 08:19:28 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 08:19:29 INFO - Return code: 0 08:19:29 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 08:19:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:29 INFO - https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:19:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:19:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:19:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:19:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:19:30 INFO - Downloaded 23345382 bytes. 08:19:30 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 08:19:30 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 08:19:32 INFO - Return code: 0 08:19:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:32 INFO - https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:19:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 08:19:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 08:19:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 08:19:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 08:19:33 INFO - Downloaded 10845168 bytes. 08:19:33 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 08:19:33 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 08:19:33 INFO - Return code: 0 08:19:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:33 INFO - https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:19:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:19:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:19:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:19:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 08:19:35 INFO - Downloaded 60561838 bytes. 08:19:35 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:19:35 INFO - mkdir: /builds/slave/test-pgo/properties 08:19:35 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 08:19:35 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 08:19:35 INFO - Contents: 08:19:35 INFO - build_url:https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:19:36 INFO - Running post-action listener: _resource_record_post_action 08:19:36 INFO - Running post-action listener: set_extra_try_arguments 08:19:36 INFO - ##### 08:19:36 INFO - ##### Running populate-webroot step. 08:19:36 INFO - ##### 08:19:36 INFO - Running pre-action listener: _resource_record_pre_action 08:19:36 INFO - Running main action method: populate_webroot 08:19:36 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:19:36 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:19:36 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:19:36 INFO - '--tppagecycles', 08:19:36 INFO - '7'], 08:19:36 INFO - 'tests': ['tsvgm']}}, 08:19:36 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 08:19:36 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:19:36 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 08:19:36 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:19:36 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:19:36 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:19:36 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:19:36 INFO - 'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:19:36 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:19:36 INFO - 'tests': ['damp', 'tps']}, 08:19:36 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:19:36 INFO - 'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['damp', 'tps']}, 08:19:36 INFO - 'g3': {'tests': ['dromaeo_dom']}, 08:19:36 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:19:36 INFO - 'other': {'tests': ['a11yr', 08:19:36 INFO - 'ts_paint', 08:19:36 INFO - 'tpaint', 08:19:36 INFO - 'sessionrestore', 08:19:36 INFO - 'sessionrestore_no_auto_restore', 08:19:36 INFO - 'tabpaint']}, 08:19:36 INFO - 'other-e10s': {'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['a11yr', 08:19:36 INFO - 'ts_paint', 08:19:36 INFO - 'tpaint', 08:19:36 INFO - 'sessionrestore', 08:19:36 INFO - 'sessionrestore_no_auto_restore', 08:19:36 INFO - 'tabpaint']}, 08:19:36 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['a11yr', 08:19:36 INFO - 'ts_paint', 08:19:36 INFO - 'tpaint', 08:19:36 INFO - 'sessionrestore', 08:19:36 INFO - 'sessionrestore_no_auto_restore', 08:19:36 INFO - 'tabpaint']}, 08:19:36 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['a11yr', 08:19:36 INFO - 'ts_paint', 08:19:36 INFO - 'tpaint', 08:19:36 INFO - 'sessionrestore', 08:19:36 INFO - 'sessionrestore_no_auto_restore', 08:19:36 INFO - 'tabpaint']}, 08:19:36 INFO - 'other_l64': {'tests': ['a11yr', 08:19:36 INFO - 'ts_paint', 08:19:36 INFO - 'tpaint', 08:19:36 INFO - 'sessionrestore', 08:19:36 INFO - 'sessionrestore_no_auto_restore', 08:19:36 INFO - 'tabpaint']}, 08:19:36 INFO - 'other_nol64': {'tests': ['a11yr', 08:19:36 INFO - 'ts_paint', 08:19:36 INFO - 'tpaint', 08:19:36 INFO - 'sessionrestore', 08:19:36 INFO - 'sessionrestore_no_auto_restore', 08:19:36 INFO - 'tabpaint']}, 08:19:36 INFO - 'svgr': {'tests': ['tsvgx', 08:19:36 INFO - 'tsvgr_opacity', 08:19:36 INFO - 'tart', 08:19:36 INFO - 'tscrollx', 08:19:36 INFO - 'cart']}, 08:19:36 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['tsvgx', 08:19:36 INFO - 'tsvgr_opacity', 08:19:36 INFO - 'tart', 08:19:36 INFO - 'tscrollx', 08:19:36 INFO - 'cart']}, 08:19:36 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:19:36 INFO - 'tests': ['tp5o']}, 08:19:36 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:19:36 INFO - 'talos_options': ['--e10s'], 08:19:36 INFO - 'tests': ['tp5o']}, 08:19:36 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:19:36 INFO - 'talos_options': ['--xperf_path', 08:19:36 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:19:36 INFO - 'tests': ['tp5n']}, 08:19:36 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:19:36 INFO - 'talos_options': ['--e10s', 08:19:36 INFO - '--xperf_path', 08:19:36 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:19:36 INFO - 'tests': ['tp5n']}}, 08:19:36 INFO - 'talos.zip': {'path': '', 08:19:36 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:19:36 INFO - Running post-action listener: _resource_record_post_action 08:19:36 INFO - ##### 08:19:36 INFO - ##### Running create-virtualenv step. 08:19:36 INFO - ##### 08:19:36 INFO - Running pre-action listener: _resource_record_pre_action 08:19:36 INFO - Running main action method: create_virtualenv 08:19:36 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 08:19:36 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 08:19:36 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 08:19:36 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:19:36 INFO - Using real prefix '/usr' 08:19:36 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 08:19:37 INFO - Installing distribute.............................................................................................................................................................................................done. 08:19:39 INFO - Installing pip.................done. 08:19:39 INFO - Return code: 0 08:19:39 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 08:19:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:39 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:39 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 08:19:39 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 08:19:39 INFO - Using env: {'DISPLAY': ':0', 08:19:39 INFO - 'HOME': '/home/cltbld', 08:19:39 INFO - 'LANG': 'en_US.UTF-8', 08:19:39 INFO - 'LANGUAGE': 'en_US:en', 08:19:39 INFO - 'LOGNAME': 'cltbld', 08:19:39 INFO - 'MAIL': '/var/mail/cltbld', 08:19:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:39 INFO - 'MOZ_NO_REMOTE': '1', 08:19:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:39 INFO - 'NO_EM_RESTART': '1', 08:19:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:39 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:39 INFO - 'SHELL': '/bin/bash', 08:19:39 INFO - 'SHLVL': '1', 08:19:39 INFO - 'TERM': 'linux', 08:19:39 INFO - 'TMOUT': '86400', 08:19:39 INFO - 'USER': 'cltbld', 08:19:39 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:39 INFO - '_': '/tools/buildbot/bin/python'} 08:19:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:39 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 08:19:39 INFO - Cleaning up... 08:19:39 INFO - Return code: 0 08:19:39 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 08:19:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:39 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:39 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 08:19:39 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 08:19:39 INFO - Using env: {'DISPLAY': ':0', 08:19:39 INFO - 'HOME': '/home/cltbld', 08:19:39 INFO - 'LANG': 'en_US.UTF-8', 08:19:39 INFO - 'LANGUAGE': 'en_US:en', 08:19:39 INFO - 'LOGNAME': 'cltbld', 08:19:39 INFO - 'MAIL': '/var/mail/cltbld', 08:19:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:39 INFO - 'MOZ_NO_REMOTE': '1', 08:19:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:39 INFO - 'NO_EM_RESTART': '1', 08:19:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:39 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:39 INFO - 'SHELL': '/bin/bash', 08:19:39 INFO - 'SHLVL': '1', 08:19:39 INFO - 'TERM': 'linux', 08:19:39 INFO - 'TMOUT': '86400', 08:19:39 INFO - 'USER': 'cltbld', 08:19:39 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:39 INFO - '_': '/tools/buildbot/bin/python'} 08:19:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:39 INFO - Downloading/unpacking psutil>=0.7.1 08:19:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:41 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 08:19:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:19:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:19:41 INFO - Installing collected packages: psutil 08:19:41 INFO - Running setup.py install for psutil 08:19:41 INFO - building 'psutil._psutil_linux' extension 08:19:41 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 08:19:41 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 08:19:41 INFO - building 'psutil._psutil_posix' extension 08:19:41 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 08:19:42 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 08:19:42 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:19:42 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:19:42 INFO - Successfully installed psutil 08:19:42 INFO - Cleaning up... 08:19:42 INFO - Return code: 0 08:19:42 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 08:19:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:42 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 08:19:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 08:19:42 INFO - Using env: {'DISPLAY': ':0', 08:19:42 INFO - 'HOME': '/home/cltbld', 08:19:42 INFO - 'LANG': 'en_US.UTF-8', 08:19:42 INFO - 'LANGUAGE': 'en_US:en', 08:19:42 INFO - 'LOGNAME': 'cltbld', 08:19:42 INFO - 'MAIL': '/var/mail/cltbld', 08:19:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:42 INFO - 'MOZ_NO_REMOTE': '1', 08:19:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:42 INFO - 'NO_EM_RESTART': '1', 08:19:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:42 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:42 INFO - 'SHELL': '/bin/bash', 08:19:42 INFO - 'SHLVL': '1', 08:19:42 INFO - 'TERM': 'linux', 08:19:42 INFO - 'TMOUT': '86400', 08:19:42 INFO - 'USER': 'cltbld', 08:19:42 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:42 INFO - '_': '/tools/buildbot/bin/python'} 08:19:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:42 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 08:19:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:44 INFO - Downloading mozsystemmonitor-0.0.tar.gz 08:19:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:19:44 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 08:19:44 INFO - Installing collected packages: mozsystemmonitor 08:19:44 INFO - Running setup.py install for mozsystemmonitor 08:19:44 INFO - Successfully installed mozsystemmonitor 08:19:44 INFO - Cleaning up... 08:19:44 INFO - Return code: 0 08:19:44 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 08:19:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:44 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:44 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 08:19:44 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:19:44 INFO - Using env: {'DISPLAY': ':0', 08:19:44 INFO - 'HOME': '/home/cltbld', 08:19:44 INFO - 'LANG': 'en_US.UTF-8', 08:19:44 INFO - 'LANGUAGE': 'en_US:en', 08:19:44 INFO - 'LOGNAME': 'cltbld', 08:19:44 INFO - 'MAIL': '/var/mail/cltbld', 08:19:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:44 INFO - 'MOZ_NO_REMOTE': '1', 08:19:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:44 INFO - 'NO_EM_RESTART': '1', 08:19:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:44 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:44 INFO - 'SHELL': '/bin/bash', 08:19:44 INFO - 'SHLVL': '1', 08:19:44 INFO - 'TERM': 'linux', 08:19:44 INFO - 'TMOUT': '86400', 08:19:44 INFO - 'USER': 'cltbld', 08:19:44 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:44 INFO - '_': '/tools/buildbot/bin/python'} 08:19:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:44 INFO - Downloading/unpacking blobuploader==1.2.4 08:19:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:46 INFO - Downloading blobuploader-1.2.4.tar.gz 08:19:46 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:19:46 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:19:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:46 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 08:19:46 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:19:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:47 INFO - Downloading docopt-0.6.1.tar.gz 08:19:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 08:19:47 INFO - Installing collected packages: blobuploader, requests, docopt 08:19:47 INFO - Running setup.py install for blobuploader 08:19:47 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:19:47 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 08:19:47 INFO - Running setup.py install for requests 08:19:47 INFO - Running setup.py install for docopt 08:19:47 INFO - Successfully installed blobuploader requests docopt 08:19:47 INFO - Cleaning up... 08:19:47 INFO - Return code: 0 08:19:47 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:19:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:47 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:47 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 08:19:47 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:19:47 INFO - Using env: {'DISPLAY': ':0', 08:19:47 INFO - 'HOME': '/home/cltbld', 08:19:47 INFO - 'LANG': 'en_US.UTF-8', 08:19:47 INFO - 'LANGUAGE': 'en_US:en', 08:19:47 INFO - 'LOGNAME': 'cltbld', 08:19:47 INFO - 'MAIL': '/var/mail/cltbld', 08:19:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:47 INFO - 'MOZ_NO_REMOTE': '1', 08:19:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:47 INFO - 'NO_EM_RESTART': '1', 08:19:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:47 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:47 INFO - 'SHELL': '/bin/bash', 08:19:47 INFO - 'SHLVL': '1', 08:19:47 INFO - 'TERM': 'linux', 08:19:47 INFO - 'TMOUT': '86400', 08:19:47 INFO - 'USER': 'cltbld', 08:19:47 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:47 INFO - '_': '/tools/buildbot/bin/python'} 08:19:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:19:48 INFO - Running setup.py (path:/tmp/pip-5B6ee1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:19:48 INFO - Running setup.py (path:/tmp/pip-lT7Fwv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:19:48 INFO - Running setup.py (path:/tmp/pip-71YLQv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:19:48 INFO - Running setup.py (path:/tmp/pip-5hvaFM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 08:19:48 INFO - Running setup.py (path:/tmp/pip-vZoL5a-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:19:48 INFO - Running setup.py (path:/tmp/pip-ckhaWT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:19:48 INFO - Running setup.py (path:/tmp/pip-zXltq3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:19:48 INFO - Running setup.py (path:/tmp/pip-DMXsIM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 08:19:48 INFO - Running setup.py (path:/tmp/pip-yjtOBr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 08:19:48 INFO - Running setup.py (path:/tmp/pip-D4llsK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:19:48 INFO - Running setup.py (path:/tmp/pip-0tr6_E-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:19:48 INFO - Running setup.py (path:/tmp/pip-3Fswt9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:19:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:19:48 INFO - Running setup.py (path:/tmp/pip-chrWT9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:19:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:19:49 INFO - Running setup.py (path:/tmp/pip-srObO7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:19:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:19:49 INFO - Running setup.py (path:/tmp/pip-DkluO5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:19:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 08:19:49 INFO - Running setup.py (path:/tmp/pip-GPPDHR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 08:19:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 08:19:49 INFO - Running setup.py (path:/tmp/pip-KMD1we-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 08:19:49 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:19:49 INFO - Running setup.py install for manifestparser 08:19:49 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 08:19:49 INFO - Running setup.py install for mozcrash 08:19:49 INFO - Running setup.py install for mozdebug 08:19:49 INFO - Running setup.py install for mozdevice 08:19:49 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 08:19:49 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 08:19:49 INFO - Running setup.py install for mozfile 08:19:49 INFO - Running setup.py install for mozhttpd 08:19:49 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 08:19:49 INFO - Running setup.py install for mozinfo 08:19:50 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Running setup.py install for mozInstall 08:19:50 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Running setup.py install for mozleak 08:19:50 INFO - Running setup.py install for mozlog 08:19:50 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Running setup.py install for moznetwork 08:19:50 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Running setup.py install for mozprocess 08:19:50 INFO - Running setup.py install for mozprofile 08:19:50 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Running setup.py install for mozrunner 08:19:50 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 08:19:50 INFO - Running setup.py install for mozscreenshot 08:19:50 INFO - Running setup.py install for moztest 08:19:50 INFO - Running setup.py install for mozversion 08:19:51 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 08:19:51 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:19:51 INFO - Cleaning up... 08:19:51 INFO - Return code: 0 08:19:51 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:19:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:51 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:51 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 08:19:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:19:51 INFO - Using env: {'DISPLAY': ':0', 08:19:51 INFO - 'HOME': '/home/cltbld', 08:19:51 INFO - 'LANG': 'en_US.UTF-8', 08:19:51 INFO - 'LANGUAGE': 'en_US:en', 08:19:51 INFO - 'LOGNAME': 'cltbld', 08:19:51 INFO - 'MAIL': '/var/mail/cltbld', 08:19:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:51 INFO - 'MOZ_NO_REMOTE': '1', 08:19:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:51 INFO - 'NO_EM_RESTART': '1', 08:19:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:51 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:51 INFO - 'SHELL': '/bin/bash', 08:19:51 INFO - 'SHLVL': '1', 08:19:51 INFO - 'TERM': 'linux', 08:19:51 INFO - 'TMOUT': '86400', 08:19:51 INFO - 'USER': 'cltbld', 08:19:51 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:51 INFO - '_': '/tools/buildbot/bin/python'} 08:19:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:19:51 INFO - Running setup.py (path:/tmp/pip-Oo4iOT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:19:51 INFO - Running setup.py (path:/tmp/pip-_HjD8L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:19:51 INFO - Running setup.py (path:/tmp/pip-G24xpB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:19:51 INFO - Running setup.py (path:/tmp/pip-UNF8Lg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 08:19:51 INFO - Running setup.py (path:/tmp/pip-3DK84S-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:19:51 INFO - Running setup.py (path:/tmp/pip-eBQDp_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:19:51 INFO - Running setup.py (path:/tmp/pip-x9iOy6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:19:51 INFO - Running setup.py (path:/tmp/pip-GUOlfO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 08:19:51 INFO - Running setup.py (path:/tmp/pip-721u_v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 08:19:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 08:19:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 08:19:51 INFO - Running setup.py (path:/tmp/pip-51Qz2x-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 08:19:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:19:52 INFO - Running setup.py (path:/tmp/pip-w4zkXt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 08:19:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:19:52 INFO - Running setup.py (path:/tmp/pip-ysu3wT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 08:19:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:19:52 INFO - Running setup.py (path:/tmp/pip-99wB8r-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 08:19:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:19:52 INFO - Running setup.py (path:/tmp/pip-wGvsJT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 08:19:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:19:52 INFO - Running setup.py (path:/tmp/pip-ZGr5A4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 08:19:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 08:19:52 INFO - Running setup.py (path:/tmp/pip-PmYWQy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 08:19:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 08:19:52 INFO - Running setup.py (path:/tmp/pip-r9Epi7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 08:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 08:19:52 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 08:19:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:54 INFO - Downloading blessings-1.6.tar.gz 08:19:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 08:19:54 INFO - Installing collected packages: blessings 08:19:54 INFO - Running setup.py install for blessings 08:19:54 INFO - Successfully installed blessings 08:19:54 INFO - Cleaning up... 08:19:54 INFO - Return code: 0 08:19:54 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 08:19:54 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 08:19:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 08:19:54 INFO - Reading from file tmpfile_stdout 08:19:54 INFO - Current package versions: 08:19:54 INFO - argparse == 1.2.1 08:19:54 INFO - blessings == 1.6 08:19:54 INFO - blobuploader == 1.2.4 08:19:54 INFO - docopt == 0.6.1 08:19:54 INFO - manifestparser == 1.1 08:19:54 INFO - mozInstall == 1.12 08:19:54 INFO - mozcrash == 0.17 08:19:54 INFO - mozdebug == 0.1 08:19:54 INFO - mozdevice == 0.48 08:19:54 INFO - mozfile == 1.2 08:19:54 INFO - mozhttpd == 0.7 08:19:54 INFO - mozinfo == 0.9 08:19:54 INFO - mozleak == 0.1 08:19:54 INFO - mozlog == 3.1 08:19:54 INFO - moznetwork == 0.27 08:19:54 INFO - mozprocess == 0.22 08:19:54 INFO - mozprofile == 0.28 08:19:54 INFO - mozrunner == 6.11 08:19:54 INFO - mozscreenshot == 0.1 08:19:54 INFO - mozsystemmonitor == 0.0 08:19:54 INFO - moztest == 0.7 08:19:54 INFO - mozversion == 1.4 08:19:54 INFO - psutil == 3.1.1 08:19:54 INFO - requests == 1.2.3 08:19:54 INFO - wsgiref == 0.1.2 08:19:54 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:19:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:54 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:54 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 08:19:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:19:54 INFO - Using env: {'DISPLAY': ':0', 08:19:54 INFO - 'HOME': '/home/cltbld', 08:19:54 INFO - 'LANG': 'en_US.UTF-8', 08:19:54 INFO - 'LANGUAGE': 'en_US:en', 08:19:54 INFO - 'LOGNAME': 'cltbld', 08:19:54 INFO - 'MAIL': '/var/mail/cltbld', 08:19:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:54 INFO - 'MOZ_NO_REMOTE': '1', 08:19:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:54 INFO - 'NO_EM_RESTART': '1', 08:19:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:54 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:54 INFO - 'SHELL': '/bin/bash', 08:19:54 INFO - 'SHLVL': '1', 08:19:54 INFO - 'TERM': 'linux', 08:19:54 INFO - 'TMOUT': '86400', 08:19:54 INFO - 'USER': 'cltbld', 08:19:54 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:54 INFO - '_': '/tools/buildbot/bin/python'} 08:19:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 08:19:55 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 08:19:55 INFO - Cleaning up... 08:19:55 INFO - Return code: 0 08:19:55 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 08:19:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:55 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:55 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 08:19:55 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 08:19:55 INFO - Using env: {'DISPLAY': ':0', 08:19:55 INFO - 'HOME': '/home/cltbld', 08:19:55 INFO - 'LANG': 'en_US.UTF-8', 08:19:55 INFO - 'LANGUAGE': 'en_US:en', 08:19:55 INFO - 'LOGNAME': 'cltbld', 08:19:55 INFO - 'MAIL': '/var/mail/cltbld', 08:19:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:55 INFO - 'MOZ_NO_REMOTE': '1', 08:19:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:55 INFO - 'NO_EM_RESTART': '1', 08:19:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:55 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:55 INFO - 'SHELL': '/bin/bash', 08:19:55 INFO - 'SHLVL': '1', 08:19:55 INFO - 'TERM': 'linux', 08:19:55 INFO - 'TMOUT': '86400', 08:19:55 INFO - 'USER': 'cltbld', 08:19:55 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:55 INFO - '_': '/tools/buildbot/bin/python'} 08:19:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:55 INFO - Downloading/unpacking jsonschema 08:19:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:57 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:19:57 INFO - Downloading/unpacking functools32 (from jsonschema) 08:19:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:57 INFO - Downloading functools32-3.2.3-2.tar.gz 08:19:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 08:19:57 INFO - warning: no files found matching '*.txt' 08:19:57 INFO - no previously-included directories found matching 'build' 08:19:57 INFO - no previously-included directories found matching 'dist' 08:19:57 INFO - no previously-included directories found matching '.git*' 08:19:57 INFO - Installing collected packages: jsonschema, functools32 08:19:57 INFO - Running setup.py install for functools32 08:19:57 INFO - warning: no files found matching '*.txt' 08:19:57 INFO - no previously-included directories found matching 'build' 08:19:57 INFO - no previously-included directories found matching 'dist' 08:19:57 INFO - no previously-included directories found matching '.git*' 08:19:57 INFO - Successfully installed jsonschema functools32 08:19:57 INFO - Cleaning up... 08:19:57 INFO - Return code: 0 08:19:57 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 08:19:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:19:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:19:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:19:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:19:57 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcd29835f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b068a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd36d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:19:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 08:19:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 08:19:57 INFO - Using env: {'DISPLAY': ':0', 08:19:57 INFO - 'HOME': '/home/cltbld', 08:19:57 INFO - 'LANG': 'en_US.UTF-8', 08:19:57 INFO - 'LANGUAGE': 'en_US:en', 08:19:57 INFO - 'LOGNAME': 'cltbld', 08:19:57 INFO - 'MAIL': '/var/mail/cltbld', 08:19:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:19:57 INFO - 'MOZ_NO_REMOTE': '1', 08:19:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:19:57 INFO - 'NO_EM_RESTART': '1', 08:19:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:19:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:19:57 INFO - 'PWD': '/builds/slave/test-pgo', 08:19:57 INFO - 'SHELL': '/bin/bash', 08:19:57 INFO - 'SHLVL': '1', 08:19:57 INFO - 'TERM': 'linux', 08:19:57 INFO - 'TMOUT': '86400', 08:19:57 INFO - 'USER': 'cltbld', 08:19:57 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:19:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:19:57 INFO - '_': '/tools/buildbot/bin/python'} 08:19:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:19:57 INFO - Downloading/unpacking flake8 08:19:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:59 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 08:19:59 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 08:19:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:59 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 08:19:59 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 08:19:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:19:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:19:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:19:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:00 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 08:20:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:20:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:20:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 08:20:00 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:20:00 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:20:00 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:20:00 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:20:00 INFO - no previously-included directories found matching 'docs/_build' 08:20:00 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 08:20:00 INFO - Running setup.py install for pep8 08:20:00 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:20:00 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:20:00 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:20:00 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:20:00 INFO - no previously-included directories found matching 'docs/_build' 08:20:00 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 08:20:00 INFO - Successfully installed flake8 mccabe pyflakes pep8 08:20:00 INFO - Cleaning up... 08:20:00 INFO - Return code: 0 08:20:00 INFO - Running post-action listener: _resource_record_post_action 08:20:00 INFO - Running post-action listener: _start_resource_monitoring 08:20:00 INFO - Starting resource monitoring. 08:20:00 INFO - ##### 08:20:00 INFO - ##### Running install step. 08:20:00 INFO - ##### 08:20:00 INFO - Running pre-action listener: _resource_record_pre_action 08:20:00 INFO - Running main action method: install 08:20:00 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 08:20:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 08:20:00 INFO - Reading from file tmpfile_stdout 08:20:00 INFO - Detecting whether we're running mozinstall >=1.0... 08:20:00 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 08:20:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 08:20:00 INFO - Reading from file tmpfile_stdout 08:20:00 INFO - Output received: 08:20:00 INFO - Usage: mozinstall [options] installer 08:20:00 INFO - Options: 08:20:00 INFO - -h, --help show this help message and exit 08:20:00 INFO - -d DEST, --destination=DEST 08:20:00 INFO - Directory to install application into. [default: 08:20:00 INFO - "/builds/slave/test-pgo"] 08:20:00 INFO - --app=APP Application being installed. [default: firefox] 08:20:00 INFO - mkdir: /builds/slave/test-pgo/build/application 08:20:00 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 08:20:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 08:20:16 INFO - Reading from file tmpfile_stdout 08:20:16 INFO - Output received: 08:20:16 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 08:20:16 INFO - Running post-action listener: _resource_record_post_action 08:20:16 INFO - ##### 08:20:16 INFO - ##### Running run-tests step. 08:20:16 INFO - ##### 08:20:16 INFO - Running pre-action listener: _resource_record_pre_action 08:20:16 INFO - Running main action method: run_tests 08:20:16 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 08:20:16 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 08:20:16 INFO - Python 2.7.3 08:20:16 INFO - Return code: 0 08:20:16 INFO - grabbing minidump binary from tooltool 08:20:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:20:16 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c62920>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c63820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c63cb0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 08:20:16 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 08:20:16 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 08:20:16 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:20:16 INFO - Return code: 0 08:20:16 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 08:20:16 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 08:20:16 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 08:20:16 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 08:20:16 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 08:20:16 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 08:20:16 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 08:20:17 INFO - Return code: 0 08:20:17 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-053', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 08:20:17 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-053 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 08:20:17 INFO - Using env: {'DISPLAY': ':0', 08:20:17 INFO - 'HOME': '/home/cltbld', 08:20:17 INFO - 'LANG': 'en_US.UTF-8', 08:20:17 INFO - 'LANGUAGE': 'en_US:en', 08:20:17 INFO - 'LOGNAME': 'cltbld', 08:20:17 INFO - 'MAIL': '/var/mail/cltbld', 08:20:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 08:20:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 08:20:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:17 INFO - 'MOZ_NO_REMOTE': '1', 08:20:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 08:20:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:17 INFO - 'NO_EM_RESTART': '1', 08:20:17 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:20:17 INFO - 'PWD': '/builds/slave/test-pgo', 08:20:17 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 08:20:17 INFO - 'SHELL': '/bin/bash', 08:20:17 INFO - 'SHLVL': '1', 08:20:17 INFO - 'TERM': 'linux', 08:20:17 INFO - 'TMOUT': '86400', 08:20:17 INFO - 'USER': 'cltbld', 08:20:17 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387', 08:20:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:17 INFO - '_': '/tools/buildbot/bin/python'} 08:20:17 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-053', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 08:20:17 INFO - mozversion application_buildid: 20160407053754 08:20:17 INFO - mozversion application_changeset: 6adef622c36b1ff4d388e1199f1ee328651ac616 08:20:17 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:20:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:20:17 INFO - mozversion application_name: Firefox 08:20:17 INFO - mozversion application_remotingname: firefox-dev 08:20:17 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:20:17 INFO - mozversion application_vendor: Mozilla 08:20:17 INFO - mozversion application_version: 47.0a2 08:20:17 INFO - mozversion platform_buildid: 20160407053754 08:20:17 INFO - mozversion platform_changeset: 6adef622c36b1ff4d388e1199f1ee328651ac616 08:20:17 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:20:17 INFO - mozversion platform_version: 47.0a2 08:20:17 INFO - using testdate: 1460042417 08:20:17 INFO - actual date: 1460042417 08:20:17 INFO - starting webserver on 'localhost:47602' 08:20:17 INFO - SUITE-START | Running 2 tests 08:20:17 INFO - TEST-START | dromaeo_css 08:20:17 INFO - operating with platform_type : linux_ 08:20:17 INFO - Initialising browser for dromaeo_css test... 08:20:17 INFO - TEST-INFO | started process 30100 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmplRWRko/profile http://localhost:47602/getInfo.html) 08:20:21 INFO - PROCESS | 30100 | __metrics Screen width/height:1600/1200 08:20:21 INFO - PROCESS | 30100 | colorDepth:24 08:20:21 INFO - PROCESS | 30100 | Browser inner width/height: 1024/697 08:20:21 INFO - PROCESS | 30100 | __metrics 08:20:22 INFO - PROCESS | 30100 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:20:23 INFO - TEST-INFO | 30100: exit 0 08:20:23 INFO - Browser initialized. 08:20:23 INFO - Running cycle 1/1 for dromaeo_css test... 08:20:23 INFO - TEST-INFO | started process 30187 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmplRWRko/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:20:35 INFO - PROCESS | 30187 | RSS: Main: 141828096 08:20:35 INFO - PROCESS | 30187 | 08:21:27 INFO - PROCESS | 30187 | 1460042487300 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 08:23:34 INFO - PROCESS | 30187 | Cycle 1(1): loaded http://localhost:47602/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47602/tests/dromaeo/cssquery-ext.html) 08:23:35 INFO - PROCESS | 30187 | RSS: Main: 216489984 08:23:35 INFO - PROCESS | 30187 | 08:26:37 INFO - PROCESS | 30187 | Cycle 1(1): loaded http://localhost:47602/tests/dromaeo/cssquery-ext.html (next: http://localhost:47602/tests/dromaeo/cssquery-jquery.html) 08:26:38 INFO - PROCESS | 30187 | RSS: Main: 217198592 08:26:38 INFO - PROCESS | 30187 | 08:29:40 INFO - PROCESS | 30187 | Cycle 1(1): loaded http://localhost:47602/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47602/tests/dromaeo/cssquery-mootools.html) 08:29:40 INFO - PROCESS | 30187 | RSS: Main: 209735680 08:29:40 INFO - PROCESS | 30187 | 08:32:42 INFO - PROCESS | 30187 | Cycle 1(1): loaded http://localhost:47602/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47602/tests/dromaeo/cssquery-prototype.html) 08:32:43 INFO - PROCESS | 30187 | RSS: Main: 207097856 08:32:43 INFO - PROCESS | 30187 | 08:35:45 INFO - PROCESS | 30187 | Cycle 1(1): loaded http://localhost:47602/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47602/tests/dromaeo/cssquery-yui.html) 08:35:46 INFO - PROCESS | 30187 | RSS: Main: 208543744 08:35:46 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | Cycle 1(1): loaded http://localhost:47602/tests/dromaeo/cssquery-yui.html (next: http://localhost:47602/tests/dromaeo/cssquery-dojo.html) 08:38:48 INFO - PROCESS | 30187 | RSS: Main: 241979392 08:38:48 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | __start_tp_report 08:38:48 INFO - PROCESS | 30187 | _x_x_mozilla_page_load 08:38:48 INFO - PROCESS | 30187 | _x_x_mozilla_page_load_details 08:38:48 INFO - PROCESS | 30187 | |i|pagename|runs| 08:38:48 INFO - PROCESS | 30187 | |0;dojo.html;3237.660045695202;3278.0329802708197;3294.687004734549;3302.5211344355052;3336.11592927874;5390.110631745757;5414.323209598805;5416;5430.56555475562;5449.182622606611;5382.8923421531545;5408.594355423339;5410.188471729242;5410.296661434018;5411.567074634029;4771.570558649721;4920.434150072751;4925.113479573675;4985.651004429691;5020.3724534433195;4938.802447902098;5047.369078865142;5052.191649336107;5052.242163675442;5053.747312634354;4933.358663373757;5020.673656212352;5025.246213068032;5030.170021946393;5030.84907452777;4811.759412029384;4900.803967841282;5082.542571168594;5094.4905509448945;5095.388553373582;4760.952390476085;4951.3810773653295;4975.701457912501;5014.5737612303;5017.799288028475;5269.525742683177;5318.175682769138;5321.2284218788445;5339.839804805862;5362.115250983583;5876.2067120938555;5901.439363260483;5902.055671092648;5910.261217347832;5911.674857882815;5705.686187259699;5836.678982655994;5881.500072493843;5907.734151963172;5914.142449344864;5480.588955828329;5527.972360138174;5544.667319960815;5554.055810512223;5562.9443705562835;6010.66941318223;6025.578209525379;6029.125776762345;6029.577929544977;6031.095335699592;5523.420040895729;5575.358833734092;5612.270404847425;5788.450097240755;5799.159121927297;5862;5876.7355469004;5880.529557635379;5880.882382352414;5880.911786323209;5795.014847475855;5839;5840.795572154954;5841.9415805842245;5844.970775146097;5633.295838020247;5800.303963524404;5855.092460668603;5929.3181284152015;5944.167816505693;4493.326001099796;4500.122476117192;4500.909981800346;4505.6846020778885;4528.592426681548;4024;4076.4700588923843;4087.3460246361033;4100.220958017967;4107;5368.543673787772;5523.447655234444;5577.386487486373;5585.218069470277;5614.606977511535;5853.297604287428;5863.794767183128;5874.765009399662;5895.705214739246;5897.616654917417;5545.473180047969;5547.306586676666;5548;5548.112302031655;5553.527950124285;4904.239842824368;4995.800167993312;5034.219695947134;5050.015247026868;5070.645054846199;5988.161657367972;6014.278286605548;6018.939810601925;6019.157317975487;6055.8486037848525;5699.943000569941;5850.765969361263;5869.413058694096;5872.706364681834;5877.059670452707;5923.259592550931;5975.462208401264;5978.611390259619;6009.158717779602;6020.157177994996;5712.885742285214;5725.7137143141845;5732.34078081026;5740.339860916049;5753.683547404766;5736.483716465538;5787.305523337226;5788.971055144697;5803.303603567599;5812.854678633068;5686.829395118153;5800.912986305125;5804.709764511673;5807.157962095557;5838.620489668158;5726.742296596746;5763.97118014424;5778.16216648592;5778.248827652546;5787.652740835563;5587.245721827501;5607.635503692247;5642.238297829905;5720.8283751487525;5750.539956803362;5654.85862853432;5714.285714285715;5716.628419152742;5810.593258471867;5813.970930145491;5529.281193444826;5533.253010843485;5554.50009499147;5578.079616863172;5629.408912064175 08:38:48 INFO - PROCESS | 30187 | |1;ext.html;550.8430097422236;560.5655616896906;564.7966731976489;567.9974844399635;622.6513152634525;31834.681653183463;41211.79394103029;41446.58553414465;41462;41491;44817.10365792682;45502;45502.31746523797;45575.31637025447;45578.316325255066;8093.554854483001;8242.423030387876;8934.91065089349;9144.222741067017;10406.531706073207;10529.315594486334;10540.683779486628;10689.412082335468;10693.411862347568;10693.83959240612;10586;10733;10734.248602597821;10736.570537178504;10738.30201036934;10626.521806518725;10717.338812484077;10722.517486713117;10724.839127413055;10728.946355268174;10519.211059170593;10992.340459572451;11004.889951100467;11011.339319640767;11027.83458248127;44310.33534496985;44710.552894470966;44717;44743.32885006727;44790;3699.075231192202;3745.213505163919;3813.675837553811;3831.578526362126;4516.5935065843905;30111.247218819484;30321.241968950733;30448.695513044808;30536.69463305361;30884;4238.978805105955;4293.935590966138;4317.136572685444;4333.609975102225;4357.7385356878685;281802;289361;289421;290046.54976725194;291306;48210.276845847344;70516.294837052;70893.2910670897;71011;71059.2894071063;46503.76748116306;46640.300395494094;46689.53310466852;46777.76611116923;46910.296345554845;15562.144082075594;16810.915945420194;17084.82915170857;17105.743413848802;17120.058396788296;11162.441877906234;14008.649783755487;14209.147451152963;14255.429782808778;14261.500847470288;15552.611184720472;15644.748758471787;15687.294071766797;15690;15703.293351799197;6147.293061298008;6180.938190618036;6206.658633775186;6225.782097626652;6251.812445626639;1022.9590816367411;1033.478093562746;1073.3345325897992;1150.6260465348796;1163.784699830534;30735.2316192097;30806.229844254074;31041.223969400944;31568.684313157035;31580;1156.6298784388914;1201.7681876076915;1232.580922486359;1244.6950497128262;1310.744404841066;16053;16238.918805406134;16335.346586136422;16386.918065409598;16588.75116873248;305143;306938;307385;307546;307678;57873.710631447415;59069.11396329058;59101.113483297784;59124;59142.11286830615;1362.4141619103682;1486.1677460622086;1506.7137243923619;1513.49297985174;1593.1237819199393;29301.41397172087;30512;30664.693353066184;30789.710700039836;31055.378892421573;48344.516554834;48649;48678.75660621816;48892.755536223514;48915;195400;198811;198981;199244;306343;35085.29829403346;35737.46393804043;35797.1050723734;35911.64088359188;36518.634813652585;43074.784626077926;43399;43429.348559770995;43770.34344484771;44075.559244407144;36029.63970360263;36044.27911441809;36071.27857442784;36229.27541449209;36500;34827.65172348244;36989.26021479609;38124.237515248984;38529.614703853724;38811.61188388193;38777.6122238774;43641;43762.56237437585;43974;44826.10347793091;35421.82289088538;35627.64372356243;36223.45664815082;36241;36761.08097297589;27339;28172.295692607848;28383.43233135367;28437;28472 08:38:48 INFO - PROCESS | 30187 | |2;jquery.html;384.3120813743399;385.4661294107662;390.1300100775271;390.58207717742016;394.81838354356995;17560.91219543902;18640.813591864076;18704.62590748184;19220.46236301096;19241.903790481065;18001.63996720065;18748.625027499475;18776.43670689878;18991.33530326439;19018.71471927922;5540.778368865251;5695.316562012544;5718.142278658213;5720.8283751487525;5725.942740572604;4190.895227619303;5903.26209223847;6171.290301615304;6173.753049878;6190.411910868483;6088.817335479943;6116.96941515294;6123.877522449548;6148.35442278561;6151.6001459904965;5871.4715675589405;6052.939470605282;6134.141220229171;6137.6624285664275;6142.8464288392925;3815.351390263662;3937.8031098444962;5251.474852514756;5442.700651464168;5449.700266485382;20917.163313467445;20957;21043.473913152142;22033.669494957587;22059;2448.0574978633176;2538.530371881208;2622.0167437211044;2771.9445611087867;2970.1980465274255;13726.284214473191;13918.512852050231;14082.366293516816;14340.139591624431;14404.927975360057;1858.089645373165;1861.190382183741;1898.9810101898943;1970.9014549272622;1972.6745087060617;63605.681971589845;64365.356346436405;64367.356326437075;64470;65180;9771.51142442875;9938.900610993942;9964.900350996542;10114.747131321776;10201;14245.287735613178;14268.286585670676;14335.139891606537;14338.139711617336;14358.066725662798;7242.855142897112;7323;7436.442266830009;7545.584992825447;8275.8344833103;7098.618389709459;7781.26078022587;7855.842883142305;7912.683492660344;7917.841643167105;4294.852573713143;4299.849505267301;4318.114786468766;4552.089582083597;4804.591609713214;1835.3576248312984;1837.5222442164866;1868.7010078387393;1888.6600411925986;1908.274855554908;961.7451375385529;1001.369137443406;1057.8205301089383;1071.737424331044;1087.445402844555;16286.755698664529;16432.260548275357;16473.258703358377;16811.579710507336;17194.226259818337;998.610541888664;1001.5893483671659;1024.462157367388;1042.3589492462233;1053.489057806963;9864.95067524672;9992.950035249924;9995.950020249998;10034.849477257847;10294.485275736184;424756;431128.6887131151;438416;440291;440946;61791.38208617946;77576.61211693905;81170;81213.59393202997;81722.59138704269;1022.6522982186092;1038.937663740178;1039.5374058543875;1040.3653771199713;1044.8798388185455;15313.540593782205;15468.5359439217;15491.147986860831;15585.922070389575;15899.682006360039;34598.481022785185;34844.65155348516;35679.64320356763;36361.27277454489;36363.636363636026;46027.53972460233;51411.742941285054;53810;54737.452625473234;54871.72564137314;8582.356323275655;8645.221930026328;8674.52290124024;8724.302055835391;8759.080296568769;13055.412506437044;13176;13247.801282980956;13284.070115092238;13290.667733306746;8664.306855451674;11244.55021799119;11290.379029153475;11381.886181138083;11470.827937580776;11057.22599418033;11175.608853690082;11407;11494.885051149717;11598.594049208237;11484.82772758426;11639.47622357013;11694.824577631172;11828.940855295668;12057.51769929193;8584.184502472255;8599;8616.569171541272;8686.695965641426;8726.956365218133;8730.56347182651;11064.170187235828;11469.827952580885;11580.942095289469;11777.646670599896 08:38:48 INFO - PROCESS | 30187 | |3;mootools.html;1441.17132648727;1610.9838901610983;1616.919154042298;1900.1663394824;2007.9157255082257;8083.232092951168;8286.95856520718;8290.212429819172;8302.377321700866;8308.376871734614;8301.792455188623;8482.279006284472;8489.066202717697;8494.745157645266;8501.744947651581;2137.348108826807;2419.745926677691;2454.055188752325;2481.019997101144;2484.1057219401;2434.4522482441484;2450.803935685141;2461.618449140386;2463.6674049003423;2463.876806159694;2459.5080983803223;2486.589712697403;2487.179230853814;2487.452760392711;2488.8631125288193;2391.485830546432;2452.350127216289;2476.3437689012426;2476.702795664514;2476.913308034219;2429.8542087474807;2444.327809852287;2447.608382658766;2455.3370589940614;2457.533068716938;8595.785105372353;8666.090060543678;8672.479651220947;8674.436161649535;8674.913250867537;5083.364579427572;5196.844094677166;5198.064348417283;5205.037068142368;5206.843794686166;3252.154439845657;3327.218103745618;3399.9660003400145;3402.4726167444087;3407.5570175877224;1066.5147357952112;1072.7318170457386;1075.8171110911164;1121.0975164992178;1128.4245035032193;11246.044086252678;11306.321620702784;11325;11341.603043893425;11348;4534.2971839364955;4566.657500687395;4628.074385122989;4637.327587499861;4655.371524844103;9698.51507424626;9717.368371055858;9721.125098741006;9724;9732.805343893082;4607.585317321457;5206.817761378334;5217.634765566374;5219.739013049332;5222.268882356473;4594.931076033862;4679.602233810097;4689.249720044776;4696.718196908197;4739.620830333565;3978.6817054635558;3992.700547458894;4004.7196696230985;4027.556968733437;4068.2880495913096;1296.461968283152;1306.3272414706435;1316.3615646411483;1320.4190156331183;1323.4772264955288;1434.9067310624775;1445.9421623134956;1447.0955652717053;1451.7314296855116;1488.9553313400615;8152.796180095545;8254.257116859511;8270.586470676562;8293.502389856629;8295.95852020736;529.0714795533813;531.5295963072631;531.9494648008433;535.7696190638063;539.4201233673816;6096;6116.204893363834;6142.293636231891;6148.9692551536955;6159.23009623797;10338.586456541805;10588.735281618021;10630.681079567625;10707.89292107069;10766.676999690022;9648.372855764354;10557.788844223072;10567.735806604896;10581.36511809294;10606.469676516142;7743.419243556756;7863.685452581947;7916.4062695299235;7924.524528528192;7957.880631790527;7896.605169741605;7905.56519391439;7974.521528708064;7975.521468711896;7988.281054705104;8699.782505437162;8788.296936244957;9121.726348209564;9198.310126740655;9198.95400522993;8832.337574682053;8998.325125615736;9046.63813447481;9168.44989300644;9200.171984521157;6520.18497687789;7269.636518173965;7501.662425190989;7582.241775822374;7720.996270484801;8171.713990010321;8208;8210.178982101743;8218.506889586644;8223.09545949957;7183.173934997542;7347.228541003117;7372.225916278713;7451.850962980601;7465.178830328551;7288.08898887639;7313.67088481009;7319.597422141834;7386.519876208029;7391.113066432063;7686.346660533917;7703.306702396587;7738.032745906762;7741.92258077412;7757.844843103219;6948.596754792671;7023.859522809413;7060.576365418091;7065.046218760402;7170.498065135391;7210.531315464478;7250.528715633467;7258.020167277561;7262.600556969417;7297.306755858185 08:38:48 INFO - PROCESS | 30187 | |4;prototype.html;354.3250108543225;358.7166138750387;362.6373626373626;364.59894116471884;370.951776269085;6057.727402266897;6059.030555111183;6082.452579267865;6088.330283668798;6111.969440152804;5978.760849566012;5983.072623743326;6064.939350606493;6065.605735627181;6068.726907289171;4515.864524064267;4603.010352774153;4647.535246475342;4695.8356457524;4725.3148293497425;4666.5566771156855;4680;4685.953140468586;4691.0617876424685;4702.036082603058;4666.416697912761;4683.578477936985;4734.928976065362;4741.976290118545;4743.217369134089;4523.705959112647;4575.199340115483;4624.699394539344;4660.347551342815;4671.902103005791;4119.9176016479505;4152.314868046768;4163.875083747493;4165.166966606661;4175.331946888483;5783.248177736909;5806.883862322772;5808.970955145197;5810.796622118248;5821.50517206038;5562.054450743383;5575.470330318613;5581.916271255935;5586.581006424493;5587.441255874421;6499.545031847772;6510.64191469469;6511.316311787242;6512.153420055362;6516.152900123001;4619.607333376667;4638.46657634373;4639.976800116012;4697.506761790031;4713.552212539803;6744.42672372844;6764.458843292525;6767.526273160832;6772.525923185379;6782.593044417351;4779.904401911942;4796.9760151199025;4801.351817504592;4812.157872372391;4812.639052071108;4875.317455556225;4887.877803054881;4888.291197776302;4890.657653964259;4895.069936712013;5534.612577119563;5538.529225015919;5540.390557038722;5545.362283337387;5550.750216240279;6284.591501552384;6484.416402523795;6528.51036172289;6536.934630653727;6577.34226577348;1712.9828701713072;1720.329071662053;1730.0311825377828;1731.2988239762917;1734.8785585008927;1118.1111016741547;1143.8055530559825;1160.460385920551;1180.5690922813283;1203.0736333023524;6149.538784591174;6239.656818875005;6240;6243.344448832898;6245.250569931637;6636.601803891782;6673.199216094003;6677.265500794909;6684.699188536528;6687.130673012574;6222.284437289679;6231.158793562901;6239.06414037898;6243.0635404688755;6244.406781355764;3571.624979377128;3604.945925811115;3615.9819200904353;3620.818959052037;3622.2031153146268;6729.663516824237;6870.793876183722;6878.071460352889;6881.311868813079;6894.620795856175;6803.795886123424;6806.149231346082;6811.318868113248;6819.659017049227;6836.863262734718;6832.59004459734;6907.723691052302;6962.895556566656;6980.371766540934;6983.1620205575655;6664.300248473841;6680.131582894192;6694.096296999843;6752.054712340178;6762.357576030269;6397.744090236339;6535.44448721864;6564;6565.113709649328;6572.934270657232;6845.14435695538;6872.828179295558;6874.346937040973;6878.793636190922;6885.862282754417;4884.682495637772;4892.4373697023875;4898;4898.53463920927;4901.362822833009;6642.269350371359;6650.501212408992;6658.933410666025;6661.267260601233;6666.300038495888;6284.780032698834;6422.550421470452;6426.100345951664;6427.903581446189;6498.935010650022;6472.126262954629;6475.676216189077;6483.2544257411;6488.740450381932;6506.446952008943;6318.304986451579;6322.525810564134;6333.904991425225;6337.683115844097;6402.775902843378;6510.609363438209;6510.641914694737;6510.674466276762;6518.934810651833;6522.673866306571;6046.637201767908;6196.380361963767;6360.522960777867;6376.936230637634;6493.642849643126 08:38:48 INFO - PROCESS | 30187 | |5;yui.html;854.1757204297851;862.6678728689454;925.9490728009965;928.3130483442254;948.1174590053732;14854.108753474786;15124.243787810621;15140.394384224644;15145.697086058271;15192.088474691527;13928.58214253574;14083;14110.223937683424;14118.294085295745;14119.505817296396;788.0740130346819;929.2937367600622;935.1863878425745;953.0564740906487;954.9522523873813;952.7141857442739;959.1080295325345;960.7742180587592;961.0869673809874;961.725908116187;1003.5935446144323;1004.4826914139225;1010.0303708439907;1010.8685870836781;1011.0243614911645;824.5588610093602;982.3712823792742;1002.3484734922285;1003.7691330993839;1005.5073014223051;734.7391675955013;738.4941315199105;738.8485360501085;738.9778306650809;739.2311995524648;13555.186688798703;13577.1853688779;13589.864101359057;13627.182369057888;13649.317534123255;12513.74972500554;12646.177998430072;12937.159084659466;12977.740445191042;13424.731505369935;10780.78438431227;10818.350898946088;10880.510377033053;10892.891071089267;10941.56233750649;3816.6755825754844;3881.9029524261837;3893.961060389388;3899.941500877489;3931.960680393188;48515.993707393674;48551.27173092406;52907.47092529064;53115.20327195134;53567;9768.413895166314;9807.166390856857;9859.112679858847;9966.950165249127;9990.900090999143;16743;16834.074125922947;16861.831381686025;16885.662286754196;16893.070881101656;7758.107817600935;7831.804204894923;8012.959935200403;8150.4294699370475;8224.62989165489;4255.212785634668;4312.956870431255;4450.621697155778;4455.2648812946145;4525.502194758574;3181.7772755907326;3195.1692559934586;3210.1332640187484;3212.839358032089;3223.7259832914465;581.3517927510795;586.3491524407904;601.7893737191948;608.5435923057706;608.7808388979963;627.2065836716557;696.7317582730584;708.6881772020295;712.7505373119367;720.5820624038046;8353.164683531599;8413.326933845277;8488.320934325238;8541.145885411534;8752.993405758292;578.4706993101265;650.2294780684904;715.4848509073458;733.8935854301096;734.6473692627462;3952.644262016375;4052.513698356216;4127.422160897477;4138.482689663792;4144.357624568197;56991.430085699445;57960.42039579635;57970;58007.709961449924;58190.12714809281;26373;50528.81190437081;50604;51030;51780.482195178316;46757.29864052042;46991.76504117458;47126;47368;47994.5200547997;8029.397795165502;8195.508269503849;8217.345416887643;8302.086770455366;8376.748697539084;36984.26031479409;36986.44520332143;37891.62108378991;38295.42556861594;39345.40981885217;43703.34444983264;44411.33382999193;44955;45191;45519.54480455153;11169.050630696156;11516.30902145874;11596.826047609124;12024.699382515157;12132.272063676208;12182.878171218174;12309.507619695112;12616.55842045524;12770.361481926053;13126.671833204246;10904.563817447213;10948.233623646587;11461.255018423775;11481.655550333504;11515.654530364103;11453.770924581628;11748.29510229389;12023.27860328383;12138.878611213775;12277.20198187115;11054.502547385226;11230.494627741935;11252.943735281271;11301.321920684784;11509.482073306554;10480.895191047992;10500.212484063573;10559.52482138321;10639.680809575726;10648.467576620984;9712.125908668253;9739.269554783561;10033.49832508357;10061.496925153566;10127.291089623655 08:38:48 INFO - PROCESS | 30187 | __end_tp_report 08:38:48 INFO - PROCESS | 30187 | __start_cc_report 08:38:48 INFO - PROCESS | 30187 | _x_x_mozilla_cycle_collect,670 08:38:48 INFO - PROCESS | 30187 | __end_cc_report 08:38:48 INFO - PROCESS | 30187 | __startTimestamp1460043528771__endTimestamp 08:38:48 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | ------- Summary: start ------- 08:38:48 INFO - PROCESS | 30187 | Number of tests: 6 08:38:48 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | [#0] dojo.html Cycles:165 Average:5432.74 Median:5612.27 stddev:593.98 (10.6%) stddev-sans-first:570.30 08:38:48 INFO - PROCESS | 30187 | Values: 3237.7 3278.0 3294.7 3302.5 3336.1 5390.1 5414.3 5416.0 5430.6 5449.2 5382.9 5408.6 5410.2 5410.3 5411.6 4771.6 4920.4 4925.1 4985.7 5020.4 4938.8 5047.4 5052.2 5052.2 5053.7 4933.4 5020.7 5025.2 5030.2 5030.8 4811.8 4900.8 5082.5 5094.5 5095.4 4761.0 4951.4 4975.7 5014.6 5017.8 5269.5 5318.2 5321.2 5339.8 5362.1 5876.2 5901.4 5902.1 5910.3 5911.7 5705.7 5836.7 5881.5 5907.7 5914.1 5480.6 5528.0 5544.7 5554.1 5562.9 6010.7 6025.6 6029.1 6029.6 6031.1 5523.4 5575.4 5612.3 5788.5 5799.2 5862.0 5876.7 5880.5 5880.9 5880.9 5795.0 5839.0 5840.8 5841.9 5845.0 5633.3 5800.3 5855.1 5929.3 5944.2 4493.3 4500.1 4500.9 4505.7 4528.6 4024.0 4076.5 4087.3 4100.2 4107.0 5368.5 5523.4 5577.4 5585.2 5614.6 5853.3 5863.8 5874.8 5895.7 5897.6 5545.5 5547.3 5548.0 5548.1 5553.5 4904.2 4995.8 5034.2 5050.0 5070.6 5988.2 6014.3 6018.9 6019.2 6055.8 5699.9 5850.8 5869.4 5872.7 5877.1 5923.3 5975.5 5978.6 6009.2 6020.2 5712.9 5725.7 5732.3 5740.3 5753.7 5736.5 5787.3 5789.0 5803.3 5812.9 5686.8 5800.9 5804.7 5807.2 5838.6 5726.7 5764.0 5778.2 5778.2 5787.7 5587.2 5607.6 5642.2 5720.8 5750.5 5654.9 5714.3 5716.6 5810.6 5814.0 5529.3 5533.3 5554.5 5578.1 5629.4 08:38:48 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | [#1] ext.html Cycles:180 Average:45847.70 Median:31707.34 stddev:71746.09 (226.3%) stddev-sans-first:71866.74 08:38:48 INFO - PROCESS | 30187 | Values: 550.8 560.6 564.8 568.0 622.7 31834.7 41211.8 41446.6 41462.0 41491.0 44817.1 45502.0 45502.3 45575.3 45578.3 8093.6 8242.4 8934.9 9144.2 10406.5 10529.3 10540.7 10689.4 10693.4 10693.8 10586.0 10733.0 10734.2 10736.6 10738.3 10626.5 10717.3 10722.5 10724.8 10728.9 10519.2 10992.3 11004.9 11011.3 11027.8 44310.3 44710.6 44717.0 44743.3 44790.0 3699.1 3745.2 3813.7 3831.6 4516.6 30111.2 30321.2 30448.7 30536.7 30884.0 4239.0 4293.9 4317.1 4333.6 4357.7 281802.0 289361.0 289421.0 290046.5 291306.0 48210.3 70516.3 70893.3 71011.0 71059.3 46503.8 46640.3 46689.5 46777.8 46910.3 15562.1 16810.9 17084.8 17105.7 17120.1 11162.4 14008.6 14209.1 14255.4 14261.5 15552.6 15644.7 15687.3 15690.0 15703.3 6147.3 6180.9 6206.7 6225.8 6251.8 1023.0 1033.5 1073.3 1150.6 1163.8 30735.2 30806.2 31041.2 31568.7 31580.0 1156.6 1201.8 1232.6 1244.7 1310.7 16053.0 16238.9 16335.3 16386.9 16588.8 305143.0 306938.0 307385.0 307546.0 307678.0 57873.7 59069.1 59101.1 59124.0 59142.1 1362.4 1486.2 1506.7 1513.5 1593.1 29301.4 30512.0 30664.7 30789.7 31055.4 48344.5 48649.0 48678.8 48892.8 48915.0 195400.0 198811.0 198981.0 199244.0 306343.0 35085.3 35737.5 35797.1 35911.6 36518.6 43074.8 43399.0 43429.3 43770.3 44075.6 36029.6 36044.3 36071.3 36229.3 36500.0 34827.7 36989.3 38124.2 38529.6 38811.6 38777.6 43641.0 43762.6 43974.0 44826.1 35421.8 35627.6 36223.5 36241.0 36761.1 27339.0 28172.3 28383.4 28437.0 28472.0 08:38:48 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | [#2] jquery.html Cycles:180 Average:26020.98 Median:34721.57 stddev:71397.92 (205.6%) stddev-sans-first:71572.26 08:38:48 INFO - PROCESS | 30187 | Values: 384.3 385.5 390.1 390.6 394.8 17560.9 18640.8 18704.6 19220.5 19241.9 18001.6 18748.6 18776.4 18991.3 19018.7 5540.8 5695.3 5718.1 5720.8 5725.9 4190.9 5903.3 6171.3 6173.8 6190.4 6088.8 6117.0 6123.9 6148.4 6151.6 5871.5 6052.9 6134.1 6137.7 6142.8 3815.4 3937.8 5251.5 5442.7 5449.7 20917.2 20957.0 21043.5 22033.7 22059.0 2448.1 2538.5 2622.0 2771.9 2970.2 13726.3 13918.5 14082.4 14340.1 14404.9 1858.1 1861.2 1899.0 1970.9 1972.7 63605.7 64365.4 64367.4 64470.0 65180.0 9771.5 9938.9 9964.9 10114.7 10201.0 14245.3 14268.3 14335.1 14338.1 14358.1 7242.9 7323.0 7436.4 7545.6 8275.8 7098.6 7781.3 7855.8 7912.7 7917.8 4294.9 4299.8 4318.1 4552.1 4804.6 1835.4 1837.5 1868.7 1888.7 1908.3 961.7 1001.4 1057.8 1071.7 1087.4 16286.8 16432.3 16473.3 16811.6 17194.2 998.6 1001.6 1024.5 1042.4 1053.5 9865.0 9993.0 9996.0 10034.8 10294.5 424756.0 431128.7 438416.0 440291.0 440946.0 61791.4 77576.6 81170.0 81213.6 81722.6 1022.7 1038.9 1039.5 1040.4 1044.9 15313.5 15468.5 15491.1 15585.9 15899.7 34598.5 34844.7 35679.6 36361.3 36363.6 46027.5 51411.7 53810.0 54737.5 54871.7 8582.4 8645.2 8674.5 8724.3 8759.1 13055.4 13176.0 13247.8 13284.1 13290.7 8664.3 11244.6 11290.4 11381.9 11470.8 11057.2 11175.6 11407.0 11494.9 11598.6 11484.8 11639.5 11694.8 11828.9 12057.5 8584.2 8599.0 8616.6 8686.7 8727.0 8730.6 11064.2 11469.8 11580.9 11777.6 08:38:48 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | [#3] mootools.html Cycles:180 Average:5922.14 Median:531.74 stddev:3090.64 (581.2%) stddev-sans-first:3080.95 08:38:48 INFO - PROCESS | 30187 | Values: 1441.2 1611.0 1616.9 1900.2 2007.9 8083.2 8287.0 8290.2 8302.4 8308.4 8301.8 8482.3 8489.1 8494.7 8501.7 2137.3 2419.7 2454.1 2481.0 2484.1 2434.5 2450.8 2461.6 2463.7 2463.9 2459.5 2486.6 2487.2 2487.5 2488.9 2391.5 2452.4 2476.3 2476.7 2476.9 2429.9 2444.3 2447.6 2455.3 2457.5 8595.8 8666.1 8672.5 8674.4 8674.9 5083.4 5196.8 5198.1 5205.0 5206.8 3252.2 3327.2 3400.0 3402.5 3407.6 1066.5 1072.7 1075.8 1121.1 1128.4 11246.0 11306.3 11325.0 11341.6 11348.0 4534.3 4566.7 4628.1 4637.3 4655.4 9698.5 9717.4 9721.1 9724.0 9732.8 4607.6 5206.8 5217.6 5219.7 5222.3 4594.9 4679.6 4689.2 4696.7 4739.6 3978.7 3992.7 4004.7 4027.6 4068.3 1296.5 1306.3 1316.4 1320.4 1323.5 1434.9 1445.9 1447.1 1451.7 1489.0 8152.8 8254.3 8270.6 8293.5 8296.0 529.1 531.5 531.9 535.8 539.4 6096.0 6116.2 6142.3 6149.0 6159.2 10338.6 10588.7 10630.7 10707.9 10766.7 9648.4 10557.8 10567.7 10581.4 10606.5 7743.4 7863.7 7916.4 7924.5 7957.9 7896.6 7905.6 7974.5 7975.5 7988.3 8699.8 8788.3 9121.7 9198.3 9199.0 8832.3 8998.3 9046.6 9168.4 9200.2 6520.2 7269.6 7501.7 7582.2 7721.0 8171.7 8208.0 8210.2 8218.5 8223.1 7183.2 7347.2 7372.2 7451.9 7465.2 7288.1 7313.7 7319.6 7386.5 7391.1 7686.3 7703.3 7738.0 7741.9 7757.8 6948.6 7023.9 7060.6 7065.0 7170.5 7210.5 7250.5 7258.0 7262.6 7297.3 08:38:48 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | [#4] prototype.html Cycles:180 Average:5451.33 Median:6130.75 stddev:1601.86 (26.1%) stddev-sans-first:1560.00 08:38:48 INFO - PROCESS | 30187 | Values: 354.3 358.7 362.6 364.6 371.0 6057.7 6059.0 6082.5 6088.3 6112.0 5978.8 5983.1 6064.9 6065.6 6068.7 4515.9 4603.0 4647.5 4695.8 4725.3 4666.6 4680.0 4686.0 4691.1 4702.0 4666.4 4683.6 4734.9 4742.0 4743.2 4523.7 4575.2 4624.7 4660.3 4671.9 4119.9 4152.3 4163.9 4165.2 4175.3 5783.2 5806.9 5809.0 5810.8 5821.5 5562.1 5575.5 5581.9 5586.6 5587.4 6499.5 6510.6 6511.3 6512.2 6516.2 4619.6 4638.5 4640.0 4697.5 4713.6 6744.4 6764.5 6767.5 6772.5 6782.6 4779.9 4797.0 4801.4 4812.2 4812.6 4875.3 4887.9 4888.3 4890.7 4895.1 5534.6 5538.5 5540.4 5545.4 5550.8 6284.6 6484.4 6528.5 6536.9 6577.3 1713.0 1720.3 1730.0 1731.3 1734.9 1118.1 1143.8 1160.5 1180.6 1203.1 6149.5 6239.7 6240.0 6243.3 6245.3 6636.6 6673.2 6677.3 6684.7 6687.1 6222.3 6231.2 6239.1 6243.1 6244.4 3571.6 3604.9 3616.0 3620.8 3622.2 6729.7 6870.8 6878.1 6881.3 6894.6 6803.8 6806.1 6811.3 6819.7 6836.9 6832.6 6907.7 6962.9 6980.4 6983.2 6664.3 6680.1 6694.1 6752.1 6762.4 6397.7 6535.4 6564.0 6565.1 6572.9 6845.1 6872.8 6874.3 6878.8 6885.9 4884.7 4892.4 4898.0 4898.5 4901.4 6642.3 6650.5 6658.9 6661.3 6666.3 6284.8 6422.6 6426.1 6427.9 6498.9 6472.1 6475.7 6483.3 6488.7 6506.4 6318.3 6322.5 6333.9 6337.7 6402.8 6510.6 6510.6 6510.7 6518.9 6522.7 6046.6 6196.4 6360.5 6376.9 6493.6 08:38:48 INFO - PROCESS | 30187 | 08:38:48 INFO - PROCESS | 30187 | [#5] yui.html Cycles:180 Average:14038.35 Median:4141.42 stddev:16058.70 (387.8%) stddev-sans-first:16073.22 08:38:48 INFO - PROCESS | 30187 | Values: 854.2 862.7 925.9 928.3 948.1 14854.1 15124.2 15140.4 15145.7 15192.1 13928.6 14083.0 14110.2 14118.3 14119.5 788.1 929.3 935.2 953.1 955.0 952.7 959.1 960.8 961.1 961.7 1003.6 1004.5 1010.0 1010.9 1011.0 824.6 982.4 1002.3 1003.8 1005.5 734.7 738.5 738.8 739.0 739.2 13555.2 13577.2 13589.9 13627.2 13649.3 12513.7 12646.2 12937.2 12977.7 13424.7 10780.8 10818.4 10880.5 10892.9 10941.6 3816.7 3881.9 3894.0 3899.9 3932.0 48516.0 48551.3 52907.5 53115.2 53567.0 9768.4 9807.2 9859.1 9967.0 9990.9 16743.0 16834.1 16861.8 16885.7 16893.1 7758.1 7831.8 8013.0 8150.4 8224.6 4255.2 4313.0 4450.6 4455.3 4525.5 3181.8 3195.2 3210.1 3212.8 3223.7 581.4 586.3 601.8 608.5 608.8 627.2 696.7 708.7 712.8 720.6 8353.2 8413.3 8488.3 8541.1 8753.0 578.5 650.2 715.5 733.9 734.6 3952.6 4052.5 4127.4 4138.5 4144.4 56991.4 57960.4 57970.0 58007.7 58190.1 26373.0 50528.8 50604.0 51030.0 51780.5 46757.3 46991.8 47126.0 47368.0 47994.5 8029.4 8195.5 8217.3 8302.1 8376.7 36984.3 36986.4 37891.6 38295.4 39345.4 43703.3 44411.3 44955.0 45191.0 45519.5 11169.1 11516.3 11596.8 12024.7 12132.3 12182.9 12309.5 12616.6 12770.4 13126.7 10904.6 10948.2 11461.3 11481.7 11515.7 11453.8 11748.3 12023.3 12138.9 12277.2 11054.5 11230.5 11252.9 11301.3 11509.5 10480.9 10500.2 10559.5 10639.7 10648.5 9712.1 9739.3 10033.5 10061.5 10127.3 08:38:48 INFO - PROCESS | 30187 | -------- Summary: end -------- 08:38:48 INFO - PROCESS | 30187 | 08:38:49 INFO - TEST-INFO | 30187: exit 0 08:38:49 INFO - TEST-OK | dromaeo_css | took 1111579ms 08:38:49 INFO - TEST-START | kraken 08:38:49 INFO - operating with platform_type : linux_ 08:38:49 INFO - Initialising browser for kraken test... 08:38:49 INFO - TEST-INFO | started process 30378 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpATp3Z2/profile http://localhost:47602/getInfo.html) 08:38:53 INFO - PROCESS | 30378 | __metrics Screen width/height:1600/1200 08:38:53 INFO - PROCESS | 30378 | colorDepth:24 08:38:53 INFO - PROCESS | 30378 | Browser inner width/height: 1024/697 08:38:53 INFO - PROCESS | 30378 | __metrics 08:38:54 INFO - PROCESS | 30378 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:38:55 INFO - TEST-INFO | 30378: exit 0 08:38:55 INFO - Browser initialized. 08:38:55 INFO - Running cycle 1/1 for kraken test... 08:38:55 INFO - TEST-INFO | started process 30466 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpATp3Z2/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:39:07 INFO - PROCESS | 30466 | RSS: Main: 142098432 08:39:07 INFO - PROCESS | 30466 | 08:39:09 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47602/tests/kraken/driver.html?testName=audio-beat-detection) 08:39:10 INFO - PROCESS | 30466 | RSS: Main: 177729536 08:39:10 INFO - PROCESS | 30466 | 08:39:12 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47602/tests/kraken/driver.html?testName=audio-dft) 08:39:13 INFO - PROCESS | 30466 | RSS: Main: 175341568 08:39:13 INFO - PROCESS | 30466 | 08:39:16 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47602/tests/kraken/driver.html?testName=audio-fft) 08:39:16 INFO - PROCESS | 30466 | RSS: Main: 173555712 08:39:16 INFO - PROCESS | 30466 | 08:39:18 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47602/tests/kraken/driver.html?testName=audio-oscillator) 08:39:19 INFO - PROCESS | 30466 | RSS: Main: 173473792 08:39:19 INFO - PROCESS | 30466 | 08:39:21 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47602/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:39:22 INFO - PROCESS | 30466 | RSS: Main: 170737664 08:39:22 INFO - PROCESS | 30466 | 08:39:25 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47602/tests/kraken/driver.html?testName=imaging-darkroom) 08:39:25 INFO - PROCESS | 30466 | RSS: Main: 171466752 08:39:25 INFO - PROCESS | 30466 | 08:39:29 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47602/tests/kraken/driver.html?testName=imaging-desaturate) 08:39:29 INFO - PROCESS | 30466 | RSS: Main: 171937792 08:39:29 INFO - PROCESS | 30466 | 08:39:32 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47602/tests/kraken/driver.html?testName=json-parse-financial) 08:39:33 INFO - PROCESS | 30466 | RSS: Main: 171483136 08:39:33 INFO - PROCESS | 30466 | 08:39:34 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47602/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:39:35 INFO - PROCESS | 30466 | RSS: Main: 175611904 08:39:35 INFO - PROCESS | 30466 | 08:39:37 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47602/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:39:37 INFO - PROCESS | 30466 | RSS: Main: 175271936 08:39:37 INFO - PROCESS | 30466 | 08:39:39 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47602/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:39:40 INFO - PROCESS | 30466 | RSS: Main: 182312960 08:39:40 INFO - PROCESS | 30466 | 08:39:42 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47602/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:39:43 INFO - PROCESS | 30466 | RSS: Main: 187609088 08:39:43 INFO - PROCESS | 30466 | 08:39:45 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47602/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:39:46 INFO - PROCESS | 30466 | RSS: Main: 185520128 08:39:46 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | Cycle 1(1): loaded http://localhost:47602/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47602/tests/kraken/driver.html?testName=ai-astar) 08:39:48 INFO - PROCESS | 30466 | RSS: Main: 248664064 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | __start_tp_report 08:39:48 INFO - PROCESS | 30466 | _x_x_mozilla_page_load 08:39:48 INFO - PROCESS | 30466 | _x_x_mozilla_page_load_details 08:39:48 INFO - PROCESS | 30466 | |i|pagename|runs| 08:39:48 INFO - PROCESS | 30466 | |0;ai-astar;109;111;107;110;111;114;100;110;110;109 08:39:48 INFO - PROCESS | 30466 | |1;audio-beat-detection;159;127;151;174;127;155;164;129;172;132 08:39:48 INFO - PROCESS | 30466 | |2;audio-dft;160;163;160;163;161;162;161;165;161;162 08:39:48 INFO - PROCESS | 30466 | |3;audio-fft;75;75;75;167;76;76;77;77;167;75 08:39:48 INFO - PROCESS | 30466 | |4;audio-oscillator;92;93;149;92;92;94;147;92;93;148 08:39:48 INFO - PROCESS | 30466 | |5;imaging-gaussian-blur;116;117;118;117;116;116;117;116;117;116 08:39:48 INFO - PROCESS | 30466 | |6;imaging-darkroom;146;145;146;147;145;146;146;146;146;146 08:39:48 INFO - PROCESS | 30466 | |7;imaging-desaturate;95;95;96;95;96;96;96;96;95;96 08:39:48 INFO - PROCESS | 30466 | |8;json-parse-financial;52;57;54;53;53;55;53;65;52;52 08:39:48 INFO - PROCESS | 30466 | |9;json-stringify-tinderbox;64;64;65;64;64;64;65;64;64;65 08:39:48 INFO - PROCESS | 30466 | |10;stanford-crypto-aes;80;86;78;78;85;78;78;86;77;78 08:39:48 INFO - PROCESS | 30466 | |11;stanford-crypto-ccm;113;117;111;115;122;119;113;113;111;123 08:39:48 INFO - PROCESS | 30466 | |12;stanford-crypto-pbkdf2;148;153;150;159;146;137;146;144;146;147 08:39:48 INFO - PROCESS | 30466 | |13;stanford-crypto-sha256-iterative;66;67;68;67;67;66;66;65;65;64 08:39:48 INFO - PROCESS | 30466 | __end_tp_report 08:39:48 INFO - PROCESS | 30466 | __start_cc_report 08:39:48 INFO - PROCESS | 30466 | _x_x_mozilla_cycle_collect,1050 08:39:48 INFO - PROCESS | 30466 | __end_cc_report 08:39:48 INFO - PROCESS | 30466 | __startTimestamp1460043588331__endTimestamp 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | ------- Summary: start ------- 08:39:48 INFO - PROCESS | 30466 | Number of tests: 14 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#0] ai-astar Cycles:10 Average:109.10 Median:110.00 stddev:3.67 (3.3%) stddev-sans-first:3.89 08:39:48 INFO - PROCESS | 30466 | Values: 109.0 111.0 107.0 110.0 111.0 114.0 100.0 110.0 110.0 109.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#1] audio-beat-detection Cycles:10 Average:149.00 Median:157.00 stddev:18.79 (12.0%) stddev-sans-first:19.57 08:39:48 INFO - PROCESS | 30466 | Values: 159.0 127.0 151.0 174.0 127.0 155.0 164.0 129.0 172.0 132.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#2] audio-dft Cycles:10 Average:161.80 Median:162.00 stddev:1.55 (1.0%) stddev-sans-first:1.50 08:39:48 INFO - PROCESS | 30466 | Values: 160.0 163.0 160.0 163.0 161.0 162.0 161.0 165.0 161.0 162.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#3] audio-fft Cycles:10 Average:94.00 Median:75.50 stddev:38.48 (51.0%) stddev-sans-first:40.20 08:39:48 INFO - PROCESS | 30466 | Values: 75.0 75.0 75.0 167.0 76.0 76.0 77.0 77.0 167.0 75.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#4] audio-oscillator Cycles:10 Average:109.20 Median:92.00 stddev:26.79 (29.1%) stddev-sans-first:27.68 08:39:48 INFO - PROCESS | 30466 | Values: 92.0 93.0 149.0 92.0 92.0 94.0 147.0 92.0 93.0 148.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#5] imaging-gaussian-blur Cycles:10 Average:116.60 Median:117.00 stddev:0.70 (0.6%) stddev-sans-first:0.71 08:39:48 INFO - PROCESS | 30466 | Values: 116.0 117.0 118.0 117.0 116.0 116.0 117.0 116.0 117.0 116.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#6] imaging-darkroom Cycles:10 Average:145.90 Median:146.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 08:39:48 INFO - PROCESS | 30466 | Values: 146.0 145.0 146.0 147.0 145.0 146.0 146.0 146.0 146.0 146.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 08:39:48 INFO - PROCESS | 30466 | Values: 95.0 95.0 96.0 95.0 96.0 96.0 96.0 96.0 95.0 96.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#8] json-parse-financial Cycles:10 Average:54.60 Median:53.50 stddev:3.98 (7.4%) stddev-sans-first:4.11 08:39:48 INFO - PROCESS | 30466 | Values: 52.0 57.0 54.0 53.0 53.0 55.0 53.0 65.0 52.0 52.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#9] json-stringify-tinderbox Cycles:10 Average:64.30 Median:64.00 stddev:0.48 (0.8%) stddev-sans-first:0.50 08:39:48 INFO - PROCESS | 30466 | Values: 64.0 64.0 65.0 64.0 64.0 64.0 65.0 64.0 64.0 65.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#10] stanford-crypto-aes Cycles:10 Average:80.40 Median:79.00 stddev:3.72 (4.7%) stddev-sans-first:3.94 08:39:48 INFO - PROCESS | 30466 | Values: 80.0 86.0 78.0 78.0 85.0 78.0 78.0 86.0 77.0 78.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#11] stanford-crypto-ccm Cycles:10 Average:115.70 Median:116.00 stddev:4.37 (3.8%) stddev-sans-first:4.53 08:39:48 INFO - PROCESS | 30466 | Values: 113.0 117.0 111.0 115.0 122.0 119.0 113.0 113.0 111.0 123.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:147.60 Median:147.50 stddev:5.76 (3.9%) stddev-sans-first:6.11 08:39:48 INFO - PROCESS | 30466 | Values: 148.0 153.0 150.0 159.0 146.0 137.0 146.0 144.0 146.0 147.0 08:39:48 INFO - PROCESS | 30466 | 08:39:48 INFO - PROCESS | 30466 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.10 Median:66.50 stddev:1.20 (1.8%) stddev-sans-first:1.27 08:39:48 INFO - PROCESS | 30466 | Values: 66.0 67.0 68.0 67.0 67.0 66.0 66.0 65.0 65.0 64.0 08:39:48 INFO - PROCESS | 30466 | -------- Summary: end -------- 08:39:48 INFO - PROCESS | 30466 | 08:39:49 INFO - TEST-INFO | 30466: exit 0 08:39:49 INFO - TEST-OK | kraken | took 60067ms 08:39:49 INFO - SUITE-END | took 1171s 08:39:49 INFO - Completed test suite (00:19:31) 08:39:49 INFO - javascript benchmark 08:39:49 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3237.660045695202, 3278.0329802708197, 3294.687004734549, 3302.5211344355052, 3336.11592927874, 5390.110631745757, 5414.323209598805, 5416.0, 5430.56555475562, 5449.182622606611, 5382.8923421531545, 5408.594355423339, 5410.188471729242, 5410.296661434018, 5411.567074634029, 4771.570558649721, 4920.434150072751, 4925.113479573675, 4985.651004429691, 5020.3724534433195, 4938.802447902098, 5047.369078865142, 5052.191649336107, 5052.242163675442, 5053.747312634354, 4933.358663373757, 5020.673656212352, 5025.246213068032, 5030.170021946393, 5030.84907452777, 4811.759412029384, 4900.803967841282, 5082.542571168594, 5094.4905509448945, 5095.388553373582, 4760.952390476085, 4951.3810773653295, 4975.701457912501, 5014.5737612303, 5017.799288028475, 5269.525742683177, 5318.175682769138, 5321.2284218788445, 5339.839804805862, 5362.115250983583, 5876.2067120938555, 5901.439363260483, 5902.055671092648, 5910.261217347832, 5911.674857882815, 5705.686187259699, 5836.678982655994, 5881.500072493843, 5907.734151963172, 5914.142449344864, 5480.588955828329, 5527.972360138174, 5544.667319960815, 5554.055810512223, 5562.9443705562835, 6010.66941318223, 6025.578209525379, 6029.125776762345, 6029.577929544977, 6031.095335699592, 5523.420040895729, 5575.358833734092, 5612.270404847425, 5788.450097240755, 5799.159121927297, 5862.0, 5876.7355469004, 5880.529557635379, 5880.882382352414, 5880.911786323209, 5795.014847475855, 5839.0, 5840.795572154954, 5841.9415805842245, 5844.970775146097, 5633.295838020247, 5800.303963524404, 5855.092460668603, 5929.3181284152015, 5944.167816505693, 4493.326001099796, 4500.122476117192, 4500.909981800346, 4505.6846020778885, 4528.592426681548, 4024.0, 4076.4700588923843, 4087.3460246361033, 4100.220958017967, 4107.0, 5368.543673787772, 5523.447655234444, 5577.386487486373, 5585.218069470277, 5614.606977511535, 5853.297604287428, 5863.794767183128, 5874.765009399662, 5895.705214739246, 5897.616654917417, 5545.473180047969, 5547.306586676666, 5548.0, 5548.112302031655, 5553.527950124285, 4904.239842824368, 4995.800167993312, 5034.219695947134, 5050.015247026868, 5070.645054846199, 5988.161657367972, 6014.278286605548, 6018.939810601925, 6019.157317975487, 6055.8486037848525, 5699.943000569941, 5850.765969361263, 5869.413058694096, 5872.706364681834, 5877.059670452707, 5923.259592550931, 5975.462208401264, 5978.611390259619, 6009.158717779602, 6020.157177994996, 5712.885742285214, 5725.7137143141845, 5732.34078081026, 5740.339860916049, 5753.683547404766, 5736.483716465538, 5787.305523337226, 5788.971055144697, 5803.303603567599, 5812.854678633068, 5686.829395118153, 5800.912986305125, 5804.709764511673, 5807.157962095557, 5838.620489668158, 5726.742296596746, 5763.97118014424, 5778.16216648592, 5778.248827652546, 5787.652740835563, 5587.245721827501, 5607.635503692247, 5642.238297829905, 5720.8283751487525, 5750.539956803362, 5654.85862853432, 5714.285714285715, 5716.628419152742, 5810.593258471867, 5813.970930145491, 5529.281193444826, 5533.253010843485, 5554.50009499147, 5578.079616863172, 5629.408912064175], "unit": "score", "name": "dojo.html", "value": 5394.9209161572}, {"lowerIsBetter": false, "replicates": [550.8430097422236, 560.5655616896906, 564.7966731976489, 567.9974844399635, 622.6513152634525, 31834.681653183463, 41211.79394103029, 41446.58553414465, 41462.0, 41491.0, 44817.10365792682, 45502.0, 45502.31746523797, 45575.31637025447, 45578.316325255066, 8093.554854483001, 8242.423030387876, 8934.91065089349, 9144.222741067017, 10406.531706073207, 10529.315594486334, 10540.683779486628, 10689.412082335468, 10693.411862347568, 10693.83959240612, 10586.0, 10733.0, 10734.248602597821, 10736.570537178504, 10738.30201036934, 10626.521806518725, 10717.338812484077, 10722.517486713117, 10724.839127413055, 10728.946355268174, 10519.211059170593, 10992.340459572451, 11004.889951100467, 11011.339319640767, 11027.83458248127, 44310.33534496985, 44710.552894470966, 44717.0, 44743.32885006727, 44790.0, 3699.075231192202, 3745.213505163919, 3813.675837553811, 3831.578526362126, 4516.5935065843905, 30111.247218819484, 30321.241968950733, 30448.695513044808, 30536.69463305361, 30884.0, 4238.978805105955, 4293.935590966138, 4317.136572685444, 4333.609975102225, 4357.7385356878685, 281802.0, 289361.0, 289421.0, 290046.54976725194, 291306.0, 48210.276845847344, 70516.294837052, 70893.2910670897, 71011.0, 71059.2894071063, 46503.76748116306, 46640.300395494094, 46689.53310466852, 46777.76611116923, 46910.296345554845, 15562.144082075594, 16810.915945420194, 17084.82915170857, 17105.743413848802, 17120.058396788296, 11162.441877906234, 14008.649783755487, 14209.147451152963, 14255.429782808778, 14261.500847470288, 15552.611184720472, 15644.748758471787, 15687.294071766797, 15690.0, 15703.293351799197, 6147.293061298008, 6180.938190618036, 6206.658633775186, 6225.782097626652, 6251.812445626639, 1022.9590816367411, 1033.478093562746, 1073.3345325897992, 1150.6260465348796, 1163.784699830534, 30735.2316192097, 30806.229844254074, 31041.223969400944, 31568.684313157035, 31580.0, 1156.6298784388914, 1201.7681876076915, 1232.580922486359, 1244.6950497128262, 1310.744404841066, 16053.0, 16238.918805406134, 16335.346586136422, 16386.918065409598, 16588.75116873248, 305143.0, 306938.0, 307385.0, 307546.0, 307678.0, 57873.710631447415, 59069.11396329058, 59101.113483297784, 59124.0, 59142.11286830615, 1362.4141619103682, 1486.1677460622086, 1506.7137243923619, 1513.49297985174, 1593.1237819199393, 29301.41397172087, 30512.0, 30664.693353066184, 30789.710700039836, 31055.378892421573, 48344.516554834, 48649.0, 48678.75660621816, 48892.755536223514, 48915.0, 195400.0, 198811.0, 198981.0, 199244.0, 306343.0, 35085.29829403346, 35737.46393804043, 35797.1050723734, 35911.64088359188, 36518.634813652585, 43074.784626077926, 43399.0, 43429.348559770995, 43770.34344484771, 44075.559244407144, 36029.63970360263, 36044.27911441809, 36071.27857442784, 36229.27541449209, 36500.0, 34827.65172348244, 36989.26021479609, 38124.237515248984, 38529.614703853724, 38811.61188388193, 38777.6122238774, 43641.0, 43762.56237437585, 43974.0, 44826.10347793091, 35421.82289088538, 35627.64372356243, 36223.45664815082, 36241.0, 36761.08097297589, 27339.0, 28172.295692607848, 28383.43233135367, 28437.0, 28472.0], "unit": "score", "name": "ext.html", "value": 19558.022647721213}, {"lowerIsBetter": false, "replicates": [384.3120813743399, 385.4661294107662, 390.1300100775271, 390.58207717742016, 394.81838354356995, 17560.91219543902, 18640.813591864076, 18704.62590748184, 19220.46236301096, 19241.903790481065, 18001.63996720065, 18748.625027499475, 18776.43670689878, 18991.33530326439, 19018.71471927922, 5540.778368865251, 5695.316562012544, 5718.142278658213, 5720.8283751487525, 5725.942740572604, 4190.895227619303, 5903.26209223847, 6171.290301615304, 6173.753049878, 6190.411910868483, 6088.817335479943, 6116.96941515294, 6123.877522449548, 6148.35442278561, 6151.6001459904965, 5871.4715675589405, 6052.939470605282, 6134.141220229171, 6137.6624285664275, 6142.8464288392925, 3815.351390263662, 3937.8031098444962, 5251.474852514756, 5442.700651464168, 5449.700266485382, 20917.163313467445, 20957.0, 21043.473913152142, 22033.669494957587, 22059.0, 2448.0574978633176, 2538.530371881208, 2622.0167437211044, 2771.9445611087867, 2970.1980465274255, 13726.284214473191, 13918.512852050231, 14082.366293516816, 14340.139591624431, 14404.927975360057, 1858.089645373165, 1861.190382183741, 1898.9810101898943, 1970.9014549272622, 1972.6745087060617, 63605.681971589845, 64365.356346436405, 64367.356326437075, 64470.0, 65180.0, 9771.51142442875, 9938.900610993942, 9964.900350996542, 10114.747131321776, 10201.0, 14245.287735613178, 14268.286585670676, 14335.139891606537, 14338.139711617336, 14358.066725662798, 7242.855142897112, 7323.0, 7436.442266830009, 7545.584992825447, 8275.8344833103, 7098.618389709459, 7781.26078022587, 7855.842883142305, 7912.683492660344, 7917.841643167105, 4294.852573713143, 4299.849505267301, 4318.114786468766, 4552.089582083597, 4804.591609713214, 1835.3576248312984, 1837.5222442164866, 1868.7010078387393, 1888.6600411925986, 1908.274855554908, 961.7451375385529, 1001.369137443406, 1057.8205301089383, 1071.737424331044, 1087.445402844555, 16286.755698664529, 16432.260548275357, 16473.258703358377, 16811.579710507336, 17194.226259818337, 998.610541888664, 1001.5893483671659, 1024.462157367388, 1042.3589492462233, 1053.489057806963, 9864.95067524672, 9992.950035249924, 9995.950020249998, 10034.849477257847, 10294.485275736184, 424756.0, 431128.6887131151, 438416.0, 440291.0, 440946.0, 61791.38208617946, 77576.61211693905, 81170.0, 81213.59393202997, 81722.59138704269, 1022.6522982186092, 1038.937663740178, 1039.5374058543875, 1040.3653771199713, 1044.8798388185455, 15313.540593782205, 15468.5359439217, 15491.147986860831, 15585.922070389575, 15899.682006360039, 34598.481022785185, 34844.65155348516, 35679.64320356763, 36361.27277454489, 36363.636363636026, 46027.53972460233, 51411.742941285054, 53810.0, 54737.452625473234, 54871.72564137314, 8582.356323275655, 8645.221930026328, 8674.52290124024, 8724.302055835391, 8759.080296568769, 13055.412506437044, 13176.0, 13247.801282980956, 13284.070115092238, 13290.667733306746, 8664.306855451674, 11244.55021799119, 11290.379029153475, 11381.886181138083, 11470.827937580776, 11057.22599418033, 11175.608853690082, 11407.0, 11494.885051149717, 11598.594049208237, 11484.82772758426, 11639.47622357013, 11694.824577631172, 11828.940855295668, 12057.51769929193, 8584.184502472255, 8599.0, 8616.569171541272, 8686.695965641426, 8726.956365218133, 8730.56347182651, 11064.170187235828, 11469.827952580885, 11580.942095289469, 11777.646670599896], "unit": "score", "name": "jquery.html", "value": 8899.03282107301}, {"lowerIsBetter": false, "replicates": [1441.17132648727, 1610.9838901610983, 1616.919154042298, 1900.1663394824, 2007.9157255082257, 8083.232092951168, 8286.95856520718, 8290.212429819172, 8302.377321700866, 8308.376871734614, 8301.792455188623, 8482.279006284472, 8489.066202717697, 8494.745157645266, 8501.744947651581, 2137.348108826807, 2419.745926677691, 2454.055188752325, 2481.019997101144, 2484.1057219401, 2434.4522482441484, 2450.803935685141, 2461.618449140386, 2463.6674049003423, 2463.876806159694, 2459.5080983803223, 2486.589712697403, 2487.179230853814, 2487.452760392711, 2488.8631125288193, 2391.485830546432, 2452.350127216289, 2476.3437689012426, 2476.702795664514, 2476.913308034219, 2429.8542087474807, 2444.327809852287, 2447.608382658766, 2455.3370589940614, 2457.533068716938, 8595.785105372353, 8666.090060543678, 8672.479651220947, 8674.436161649535, 8674.913250867537, 5083.364579427572, 5196.844094677166, 5198.064348417283, 5205.037068142368, 5206.843794686166, 3252.154439845657, 3327.218103745618, 3399.9660003400145, 3402.4726167444087, 3407.5570175877224, 1066.5147357952112, 1072.7318170457386, 1075.8171110911164, 1121.0975164992178, 1128.4245035032193, 11246.044086252678, 11306.321620702784, 11325.0, 11341.603043893425, 11348.0, 4534.2971839364955, 4566.657500687395, 4628.074385122989, 4637.327587499861, 4655.371524844103, 9698.51507424626, 9717.368371055858, 9721.125098741006, 9724.0, 9732.805343893082, 4607.585317321457, 5206.817761378334, 5217.634765566374, 5219.739013049332, 5222.268882356473, 4594.931076033862, 4679.602233810097, 4689.249720044776, 4696.718196908197, 4739.620830333565, 3978.6817054635558, 3992.700547458894, 4004.7196696230985, 4027.556968733437, 4068.2880495913096, 1296.461968283152, 1306.3272414706435, 1316.3615646411483, 1320.4190156331183, 1323.4772264955288, 1434.9067310624775, 1445.9421623134956, 1447.0955652717053, 1451.7314296855116, 1488.9553313400615, 8152.796180095545, 8254.257116859511, 8270.586470676562, 8293.502389856629, 8295.95852020736, 529.0714795533813, 531.5295963072631, 531.9494648008433, 535.7696190638063, 539.4201233673816, 6096.0, 6116.204893363834, 6142.293636231891, 6148.9692551536955, 6159.23009623797, 10338.586456541805, 10588.735281618021, 10630.681079567625, 10707.89292107069, 10766.676999690022, 9648.372855764354, 10557.788844223072, 10567.735806604896, 10581.36511809294, 10606.469676516142, 7743.419243556756, 7863.685452581947, 7916.4062695299235, 7924.524528528192, 7957.880631790527, 7896.605169741605, 7905.56519391439, 7974.521528708064, 7975.521468711896, 7988.281054705104, 8699.782505437162, 8788.296936244957, 9121.726348209564, 9198.310126740655, 9198.95400522993, 8832.337574682053, 8998.325125615736, 9046.63813447481, 9168.44989300644, 9200.171984521157, 6520.18497687789, 7269.636518173965, 7501.662425190989, 7582.241775822374, 7720.996270484801, 8171.713990010321, 8208.0, 8210.178982101743, 8218.506889586644, 8223.09545949957, 7183.173934997542, 7347.228541003117, 7372.225916278713, 7451.850962980601, 7465.178830328551, 7288.08898887639, 7313.67088481009, 7319.597422141834, 7386.519876208029, 7391.113066432063, 7686.346660533917, 7703.306702396587, 7738.032745906762, 7741.92258077412, 7757.844843103219, 6948.596754792671, 7023.859522809413, 7060.576365418091, 7065.046218760402, 7170.498065135391, 7210.531315464478, 7250.528715633467, 7258.020167277561, 7262.600556969417, 7297.306755858185], "unit": "score", "name": "mootools.html", "value": 4790.699513833847}, {"lowerIsBetter": false, "replicates": [354.3250108543225, 358.7166138750387, 362.6373626373626, 364.59894116471884, 370.951776269085, 6057.727402266897, 6059.030555111183, 6082.452579267865, 6088.330283668798, 6111.969440152804, 5978.760849566012, 5983.072623743326, 6064.939350606493, 6065.605735627181, 6068.726907289171, 4515.864524064267, 4603.010352774153, 4647.535246475342, 4695.8356457524, 4725.3148293497425, 4666.5566771156855, 4680.0, 4685.953140468586, 4691.0617876424685, 4702.036082603058, 4666.416697912761, 4683.578477936985, 4734.928976065362, 4741.976290118545, 4743.217369134089, 4523.705959112647, 4575.199340115483, 4624.699394539344, 4660.347551342815, 4671.902103005791, 4119.9176016479505, 4152.314868046768, 4163.875083747493, 4165.166966606661, 4175.331946888483, 5783.248177736909, 5806.883862322772, 5808.970955145197, 5810.796622118248, 5821.50517206038, 5562.054450743383, 5575.470330318613, 5581.916271255935, 5586.581006424493, 5587.441255874421, 6499.545031847772, 6510.64191469469, 6511.316311787242, 6512.153420055362, 6516.152900123001, 4619.607333376667, 4638.46657634373, 4639.976800116012, 4697.506761790031, 4713.552212539803, 6744.42672372844, 6764.458843292525, 6767.526273160832, 6772.525923185379, 6782.593044417351, 4779.904401911942, 4796.9760151199025, 4801.351817504592, 4812.157872372391, 4812.639052071108, 4875.317455556225, 4887.877803054881, 4888.291197776302, 4890.657653964259, 4895.069936712013, 5534.612577119563, 5538.529225015919, 5540.390557038722, 5545.362283337387, 5550.750216240279, 6284.591501552384, 6484.416402523795, 6528.51036172289, 6536.934630653727, 6577.34226577348, 1712.9828701713072, 1720.329071662053, 1730.0311825377828, 1731.2988239762917, 1734.8785585008927, 1118.1111016741547, 1143.8055530559825, 1160.460385920551, 1180.5690922813283, 1203.0736333023524, 6149.538784591174, 6239.656818875005, 6240.0, 6243.344448832898, 6245.250569931637, 6636.601803891782, 6673.199216094003, 6677.265500794909, 6684.699188536528, 6687.130673012574, 6222.284437289679, 6231.158793562901, 6239.06414037898, 6243.0635404688755, 6244.406781355764, 3571.624979377128, 3604.945925811115, 3615.9819200904353, 3620.818959052037, 3622.2031153146268, 6729.663516824237, 6870.793876183722, 6878.071460352889, 6881.311868813079, 6894.620795856175, 6803.795886123424, 6806.149231346082, 6811.318868113248, 6819.659017049227, 6836.863262734718, 6832.59004459734, 6907.723691052302, 6962.895556566656, 6980.371766540934, 6983.1620205575655, 6664.300248473841, 6680.131582894192, 6694.096296999843, 6752.054712340178, 6762.357576030269, 6397.744090236339, 6535.44448721864, 6564.0, 6565.113709649328, 6572.934270657232, 6845.14435695538, 6872.828179295558, 6874.346937040973, 6878.793636190922, 6885.862282754417, 4884.682495637772, 4892.4373697023875, 4898.0, 4898.53463920927, 4901.362822833009, 6642.269350371359, 6650.501212408992, 6658.933410666025, 6661.267260601233, 6666.300038495888, 6284.780032698834, 6422.550421470452, 6426.100345951664, 6427.903581446189, 6498.935010650022, 6472.126262954629, 6475.676216189077, 6483.2544257411, 6488.740450381932, 6506.446952008943, 6318.304986451579, 6322.525810564134, 6333.904991425225, 6337.683115844097, 6402.775902843378, 6510.609363438209, 6510.641914694737, 6510.674466276762, 6518.934810651833, 6522.673866306571, 6046.637201767908, 6196.380361963767, 6360.522960777867, 6376.936230637634, 6493.642849643126], "unit": "score", "name": "prototype.html", "value": 4939.978545538228}, {"lowerIsBetter": false, "replicates": [854.1757204297851, 862.6678728689454, 925.9490728009965, 928.3130483442254, 948.1174590053732, 14854.108753474786, 15124.243787810621, 15140.394384224644, 15145.697086058271, 15192.088474691527, 13928.58214253574, 14083.0, 14110.223937683424, 14118.294085295745, 14119.505817296396, 788.0740130346819, 929.2937367600622, 935.1863878425745, 953.0564740906487, 954.9522523873813, 952.7141857442739, 959.1080295325345, 960.7742180587592, 961.0869673809874, 961.725908116187, 1003.5935446144323, 1004.4826914139225, 1010.0303708439907, 1010.8685870836781, 1011.0243614911645, 824.5588610093602, 982.3712823792742, 1002.3484734922285, 1003.7691330993839, 1005.5073014223051, 734.7391675955013, 738.4941315199105, 738.8485360501085, 738.9778306650809, 739.2311995524648, 13555.186688798703, 13577.1853688779, 13589.864101359057, 13627.182369057888, 13649.317534123255, 12513.74972500554, 12646.177998430072, 12937.159084659466, 12977.740445191042, 13424.731505369935, 10780.78438431227, 10818.350898946088, 10880.510377033053, 10892.891071089267, 10941.56233750649, 3816.6755825754844, 3881.9029524261837, 3893.961060389388, 3899.941500877489, 3931.960680393188, 48515.993707393674, 48551.27173092406, 52907.47092529064, 53115.20327195134, 53567.0, 9768.413895166314, 9807.166390856857, 9859.112679858847, 9966.950165249127, 9990.900090999143, 16743.0, 16834.074125922947, 16861.831381686025, 16885.662286754196, 16893.070881101656, 7758.107817600935, 7831.804204894923, 8012.959935200403, 8150.4294699370475, 8224.62989165489, 4255.212785634668, 4312.956870431255, 4450.621697155778, 4455.2648812946145, 4525.502194758574, 3181.7772755907326, 3195.1692559934586, 3210.1332640187484, 3212.839358032089, 3223.7259832914465, 581.3517927510795, 586.3491524407904, 601.7893737191948, 608.5435923057706, 608.7808388979963, 627.2065836716557, 696.7317582730584, 708.6881772020295, 712.7505373119367, 720.5820624038046, 8353.164683531599, 8413.326933845277, 8488.320934325238, 8541.145885411534, 8752.993405758292, 578.4706993101265, 650.2294780684904, 715.4848509073458, 733.8935854301096, 734.6473692627462, 3952.644262016375, 4052.513698356216, 4127.422160897477, 4138.482689663792, 4144.357624568197, 56991.430085699445, 57960.42039579635, 57970.0, 58007.709961449924, 58190.12714809281, 26373.0, 50528.81190437081, 50604.0, 51030.0, 51780.482195178316, 46757.29864052042, 46991.76504117458, 47126.0, 47368.0, 47994.5200547997, 8029.397795165502, 8195.508269503849, 8217.345416887643, 8302.086770455366, 8376.748697539084, 36984.26031479409, 36986.44520332143, 37891.62108378991, 38295.42556861594, 39345.40981885217, 43703.34444983264, 44411.33382999193, 44955.0, 45191.0, 45519.54480455153, 11169.050630696156, 11516.30902145874, 11596.826047609124, 12024.699382515157, 12132.272063676208, 12182.878171218174, 12309.507619695112, 12616.55842045524, 12770.361481926053, 13126.671833204246, 10904.563817447213, 10948.233623646587, 11461.255018423775, 11481.655550333504, 11515.654530364103, 11453.770924581628, 11748.29510229389, 12023.27860328383, 12138.878611213775, 12277.20198187115, 11054.502547385226, 11230.494627741935, 11252.943735281271, 11301.321920684784, 11509.482073306554, 10480.895191047992, 10500.212484063573, 10559.52482138321, 10639.680809575726, 10648.467576620984, 9712.125908668253, 9739.269554783561, 10033.49832508357, 10061.496925153566, 10127.291089623655], "unit": "score", "name": "yui.html", "value": 6616.731961127826}], "name": "dromaeo_css", "value": 7265.121825637459}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [109.0, 111.0, 107.0, 110.0, 111.0, 114.0, 100.0, 110.0, 110.0, 109.0], "unit": "score", "name": "ai-astar", "value": 109.1}, {"lowerIsBetter": true, "replicates": [159.0, 127.0, 151.0, 174.0, 127.0, 155.0, 164.0, 129.0, 172.0, 132.0], "unit": "score", "name": "audio-beat-detection", "value": 149.0}, {"lowerIsBetter": true, "replicates": [160.0, 163.0, 160.0, 163.0, 161.0, 162.0, 161.0, 165.0, 161.0, 162.0], "unit": "score", "name": "audio-dft", "value": 161.8}, {"lowerIsBetter": true, "replicates": [75.0, 75.0, 75.0, 167.0, 76.0, 76.0, 77.0, 77.0, 167.0, 75.0], "unit": "score", "name": "audio-fft", "value": 94.0}, {"lowerIsBetter": true, "replicates": [92.0, 93.0, 149.0, 92.0, 92.0, 94.0, 147.0, 92.0, 93.0, 148.0], "unit": "score", "name": "audio-oscillator", "value": 109.2}, {"lowerIsBetter": true, "replicates": [116.0, 117.0, 118.0, 117.0, 116.0, 116.0, 117.0, 116.0, 117.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.6}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 146.0, 147.0, 145.0, 146.0, 146.0, 146.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.9}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.6}, {"lowerIsBetter": true, "replicates": [52.0, 57.0, 54.0, 53.0, 53.0, 55.0, 53.0, 65.0, 52.0, 52.0], "unit": "score", "name": "json-parse-financial", "value": 54.6}, {"lowerIsBetter": true, "replicates": [64.0, 64.0, 65.0, 64.0, 64.0, 64.0, 65.0, 64.0, 64.0, 65.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.3}, {"lowerIsBetter": true, "replicates": [80.0, 86.0, 78.0, 78.0, 85.0, 78.0, 78.0, 86.0, 77.0, 78.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.4}, {"lowerIsBetter": true, "replicates": [113.0, 117.0, 111.0, 115.0, 122.0, 119.0, 113.0, 113.0, 111.0, 123.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 115.7}, {"lowerIsBetter": true, "replicates": [148.0, 153.0, 150.0, 159.0, 146.0, 137.0, 146.0, 144.0, 146.0, 147.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 147.6}, {"lowerIsBetter": true, "replicates": [66.0, 67.0, 68.0, 67.0, 67.0, 66.0, 66.0, 65.0, 65.0, 64.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.1}], "name": "kraken", "value": 1509.9}]} 08:39:49 INFO - Return code: 0 08:39:49 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 08:39:49 INFO - # TBPL SUCCESS # 08:39:49 INFO - Running post-action listener: _resource_record_post_action 08:39:49 INFO - Running post-run listener: _resource_record_post_run 08:39:50 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 0; Write bytes: 503517184; Read time: 0; Write time: 593080 08:39:50 INFO - install - Wall time: 16s; CPU: 15.0%; Read bytes: 0; Write bytes: 256237568; Read time: 0; Write time: 350416 08:39:50 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 0; Write bytes: 247263232; Read time: 0; Write time: 242664 08:39:50 INFO - Running post-run listener: _upload_blobber_files 08:39:50 INFO - Blob upload gear active. 08:39:50 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 08:39:50 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 08:39:50 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 08:39:50 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Mozilla-Aurora -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 08:39:51 INFO - (blobuploader) - INFO - Open directory for files ... 08:39:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:39:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:39:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:39:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:39:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:39:51 INFO - (blobuploader) - INFO - Done attempting. 08:39:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 08:39:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:39:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:39:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:39:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:39:52 INFO - (blobuploader) - INFO - Done attempting. 08:39:52 INFO - (blobuploader) - INFO - Iteration through files over. 08:39:52 INFO - Return code: 0 08:39:52 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 08:39:52 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 08:39:52 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d2d53b8306171e24688906ebb1ec34e6e83e15f21567bb394b5aa91e587f7e51bddc401aa6b81464b2d655ab478a9880da7f0f2ee06de5fd4db34d155d93a42b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5ca84670ca5895fb7e5c6e78132cdde00474cae4ef9124fd85e6dda2bd55aab1488754c3322e3c1994fc69f79b6e9594303b6af79acb5f88ac5d51a8c5fc4347"} 08:39:52 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 08:39:52 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 08:39:52 INFO - Contents: 08:39:52 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d2d53b8306171e24688906ebb1ec34e6e83e15f21567bb394b5aa91e587f7e51bddc401aa6b81464b2d655ab478a9880da7f0f2ee06de5fd4db34d155d93a42b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5ca84670ca5895fb7e5c6e78132cdde00474cae4ef9124fd85e6dda2bd55aab1488754c3322e3c1994fc69f79b6e9594303b6af79acb5f88ac5d51a8c5fc4347"} 08:39:52 INFO - Running post-run listener: copy_logs_to_upload_dir 08:39:52 INFO - Copying logs to upload dir... 08:39:52 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 08:39:52 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1226.802893 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 26 secs) (at 2016-04-07 08:39:51.842315) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-07 08:39:51.845646) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test-pgo/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d2d53b8306171e24688906ebb1ec34e6e83e15f21567bb394b5aa91e587f7e51bddc401aa6b81464b2d655ab478a9880da7f0f2ee06de5fd4db34d155d93a42b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5ca84670ca5895fb7e5c6e78132cdde00474cae4ef9124fd85e6dda2bd55aab1488754c3322e3c1994fc69f79b6e9594303b6af79acb5f88ac5d51a8c5fc4347"} build_url:https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011312 build_url: 'https://queue.taskcluster.net/v1/task/bAcAKx4WQLm2vh9WUUDnpQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d2d53b8306171e24688906ebb1ec34e6e83e15f21567bb394b5aa91e587f7e51bddc401aa6b81464b2d655ab478a9880da7f0f2ee06de5fd4db34d155d93a42b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5ca84670ca5895fb7e5c6e78132cdde00474cae4ef9124fd85e6dda2bd55aab1488754c3322e3c1994fc69f79b6e9594303b6af79acb5f88ac5d51a8c5fc4347"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-07 08:39:51.870038) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:39:51.870344) ========= rm -f oauth.txt in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=920470bf432669ad7e3a5387000001ca-1460042363.443536-1458852387 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004791 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:39:51.952996) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-07 08:39:51.953321) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-07 08:39:51.953601) ========= ========= Total master_lag: 0.28 =========