builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-054 starttime: 1465961044.64 results: success (0) buildid: 20160614171307 builduid: 82bf56d5c4d34fa6805db3edcb6897fb revision: cf14f77f4f1d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.640834) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.641534) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.641853) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.743288) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.743555) ========= 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/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-14 20:24:06-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 66.2M=0s 2016-06-14 20:24:06 (66.2 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.112540 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.903167) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.906488) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', '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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018216 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.955869) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:04.956186) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev cf14f77f4f1d --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev cf14f77f4f1d --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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-14 20:24:06,842 Setting DEBUG logging. 2016-06-14 20:24:06,842 attempt 1/10 2016-06-14 20:24:06,842 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/cf14f77f4f1d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-14 20:24:07,428 unpacking tar archive at: fx-team-cf14f77f4f1d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.958619 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:05.940023) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:05.943319) ========= script_repo_revision: cf14f77f4f1d ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:05.943712) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:05.943974) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-14 20:24:05.954531) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-06-14 20:24:05.954853) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 20:24:07 INFO - MultiFileLogger online at 20160614 20:24:07 in /builds/slave/test 20:24:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 20:24:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 20:24:07 INFO - {'append_to_log': False, 20:24:07 INFO - 'base_work_dir': '/builds/slave/test', 20:24:07 INFO - 'blob_upload_branch': 'Fx-Team', 20:24:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 20:24:07 INFO - 'branch': 'Fx-Team', 20:24:07 INFO - 'buildbot_json_path': 'buildprops.json', 20:24:07 INFO - 'config_files': ('talos/linux_config.py',), 20:24:07 INFO - 'default_actions': ('clobber', 20:24:07 INFO - 'read-buildbot-config', 20:24:07 INFO - 'download-and-extract', 20:24:07 INFO - 'populate-webroot', 20:24:07 INFO - 'create-virtualenv', 20:24:07 INFO - 'install', 20:24:07 INFO - 'run-tests'), 20:24:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 20:24:07 INFO - 'download_minidump_stackwalk': True, 20:24:07 INFO - 'download_symbols': 'ondemand', 20:24:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 20:24:07 INFO - 'tooltool.py': '/tools/tooltool.py', 20:24:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 20:24:07 INFO - '/tools/misc-python/virtualenv.py')}, 20:24:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 20:24:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 20:24:07 INFO - 'installer_path': 'installer.exe', 20:24:07 INFO - 'log_level': 'info', 20:24:07 INFO - 'log_name': 'talos', 20:24:07 INFO - 'log_to_console': True, 20:24:07 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 20:24:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 20:24:07 INFO - 'opt_config_files': (), 20:24:07 INFO - 'pip_index': False, 20:24:07 INFO - 'sps_profile': False, 20:24:07 INFO - 'sps_profile_interval': 0, 20:24:07 INFO - 'suite': 'dromaeojs-e10s', 20:24:07 INFO - 'system_bits': '32', 20:24:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 20:24:07 INFO - 'title': 'talos-linux64-ix-054', 20:24:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 20:24:07 INFO - 'use_talos_json': True, 20:24:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 20:24:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 20:24:07 INFO - 'work_dir': 'build'} 20:24:07 INFO - ##### 20:24:07 INFO - ##### Running clobber step. 20:24:07 INFO - ##### 20:24:07 INFO - Running pre-action listener: _resource_record_pre_action 20:24:07 INFO - Running main action method: clobber 20:24:07 INFO - rmtree: /builds/slave/test/build 20:24:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 20:24:08 INFO - Running post-action listener: _resource_record_post_action 20:24:08 INFO - ##### 20:24:08 INFO - ##### Finished clobber step (success) 20:24:08 INFO - ##### 20:24:08 INFO - ##### 20:24:08 INFO - ##### Running read-buildbot-config step. 20:24:08 INFO - ##### 20:24:08 INFO - Running pre-action listener: _resource_record_pre_action 20:24:08 INFO - Running main action method: read_buildbot_config 20:24:08 INFO - Using buildbot properties: 20:24:08 INFO - { 20:24:08 INFO - "project": "", 20:24:08 INFO - "product": "firefox", 20:24:08 INFO - "script_repo_revision": "production", 20:24:08 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 20:24:08 INFO - "repository": "", 20:24:08 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 20:24:08 INFO - "buildid": "20160614171307", 20:24:08 INFO - "pgo_build": "True", 20:24:08 INFO - "basedir": "/builds/slave/test", 20:24:08 INFO - "buildnumber": 557, 20:24:08 INFO - "slavename": "talos-linux64-ix-054", 20:24:08 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 20:24:08 INFO - "platform": "ubuntu64_hw", 20:24:08 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 20:24:08 INFO - "branch": "fx-team", 20:24:08 INFO - "repo_path": "integration/fx-team", 20:24:08 INFO - "revision": "cf14f77f4f1d", 20:24:08 INFO - "stage_platform": "linux64-pgo", 20:24:08 INFO - "builduid": "82bf56d5c4d34fa6805db3edcb6897fb", 20:24:08 INFO - "slavebuilddir": "test" 20:24:08 INFO - } 20:24:08 INFO - Found installer url https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 20:24:08 INFO - Running post-action listener: _resource_record_post_action 20:24:08 INFO - ##### 20:24:08 INFO - ##### Finished read-buildbot-config step (success) 20:24:08 INFO - ##### 20:24:08 INFO - ##### 20:24:08 INFO - ##### Running download-and-extract step. 20:24:08 INFO - ##### 20:24:08 INFO - Running pre-action listener: _resource_record_pre_action 20:24:08 INFO - Running main action method: download_and_extract 20:24:08 INFO - mkdir: /builds/slave/test/build/tests 20:24:08 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')]} 20:24:08 INFO - https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 20:24:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:24:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:24:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:24:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 20:24:13 INFO - Downloaded 1361 bytes. 20:24:13 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:24:13 INFO - Using the following test package requirements: 20:24:13 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 20:24:13 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:24:13 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 20:24:13 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:24:13 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 20:24:13 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:24:13 INFO - u'jsshell-linux-x86_64.zip'], 20:24:13 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:24:13 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 20:24:13 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 20:24:13 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:24:13 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 20:24:13 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:24:13 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 20:24:13 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:24:13 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 20:24:13 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:24:13 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 20:24:13 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 20:24:13 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')]} 20:24:13 INFO - https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 20:24:13 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:24:13 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:24:13 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:24:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 20:24:14 INFO - Downloaded 24219986 bytes. 20:24:14 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:24:14 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 20:24:15 INFO - Return code: 0 20:24:15 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 20:24:15 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')]} 20:24:15 INFO - https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 20:24:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:24:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:24:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:24:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 20:24:17 INFO - Downloaded 24219986 bytes. 20:24:17 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:24:17 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 20:24:19 INFO - Return code: 0 20:24:19 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')]} 20:24:19 INFO - https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 20:24:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:24:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:24:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:24:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 20:24:20 INFO - Downloaded 14405384 bytes. 20:24:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:24:20 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 20:24:20 INFO - Return code: 0 20:24:20 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')]} 20:24:20 INFO - https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 20:24:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:24:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:24:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:24:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 20:24:21 INFO - Downloaded 59350299 bytes. 20:24:21 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:24:21 INFO - mkdir: /builds/slave/test/properties 20:24:21 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 20:24:21 INFO - Writing to file /builds/slave/test/properties/build_url 20:24:21 INFO - Contents: 20:24:21 INFO - build_url:https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:24:22 INFO - Running post-action listener: _resource_record_post_action 20:24:22 INFO - Running post-action listener: set_extra_try_arguments 20:24:22 INFO - ##### 20:24:22 INFO - ##### Finished download-and-extract step (success) 20:24:22 INFO - ##### 20:24:22 INFO - ##### 20:24:22 INFO - ##### Running populate-webroot step. 20:24:22 INFO - ##### 20:24:22 INFO - Running pre-action listener: _resource_record_pre_action 20:24:22 INFO - Running main action method: populate_webroot 20:24:22 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 20:24:22 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 20:24:22 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 20:24:22 INFO - '--tppagecycles', 20:24:22 INFO - '7'], 20:24:22 INFO - 'tests': ['tsvgm']}}, 20:24:22 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['tresize', 'tcanvasmark']}, 20:24:22 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 20:24:22 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['dromaeo_css', 'kraken']}, 20:24:22 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 20:24:22 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:24:22 INFO - 'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 20:24:22 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:24:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 20:24:22 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:24:22 INFO - 'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['damp', 'tps']}, 20:24:22 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:24:22 INFO - 'tests': ['damp', 'tps']}, 20:24:22 INFO - 'g3': {'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['dromaeo_dom']}, 20:24:22 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 20:24:22 INFO - 'g4': {'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['basic_compositor_video']}, 20:24:22 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 20:24:22 INFO - 'other': {'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['a11yr', 20:24:22 INFO - 'ts_paint', 20:24:22 INFO - 'tpaint', 20:24:22 INFO - 'sessionrestore', 20:24:22 INFO - 'sessionrestore_no_auto_restore', 20:24:22 INFO - 'tabpaint']}, 20:24:22 INFO - 'other-e10s': {'tests': ['a11yr', 20:24:22 INFO - 'ts_paint', 20:24:22 INFO - 'tpaint', 20:24:22 INFO - 'sessionrestore', 20:24:22 INFO - 'sessionrestore_no_auto_restore', 20:24:22 INFO - 'tabpaint']}, 20:24:22 INFO - 'other-e10s_l64': {'tests': ['a11yr', 20:24:22 INFO - 'ts_paint', 20:24:22 INFO - 'tpaint', 20:24:22 INFO - 'sessionrestore', 20:24:22 INFO - 'sessionrestore_no_auto_restore', 20:24:22 INFO - 'tabpaint']}, 20:24:22 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 20:24:22 INFO - 'ts_paint', 20:24:22 INFO - 'tpaint', 20:24:22 INFO - 'sessionrestore', 20:24:22 INFO - 'sessionrestore_no_auto_restore', 20:24:22 INFO - 'tabpaint']}, 20:24:22 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['a11yr', 20:24:22 INFO - 'ts_paint', 20:24:22 INFO - 'tpaint', 20:24:22 INFO - 'sessionrestore', 20:24:22 INFO - 'sessionrestore_no_auto_restore', 20:24:22 INFO - 'tabpaint']}, 20:24:22 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['a11yr', 20:24:22 INFO - 'ts_paint', 20:24:22 INFO - 'tpaint', 20:24:22 INFO - 'sessionrestore', 20:24:22 INFO - 'sessionrestore_no_auto_restore', 20:24:22 INFO - 'tabpaint']}, 20:24:22 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['tsvgx', 20:24:22 INFO - 'tsvgr_opacity', 20:24:22 INFO - 'tart', 20:24:22 INFO - 'tscrollx', 20:24:22 INFO - 'cart']}, 20:24:22 INFO - 'svgr-e10s': {'tests': ['tsvgx', 20:24:22 INFO - 'tsvgr_opacity', 20:24:22 INFO - 'tart', 20:24:22 INFO - 'tscrollx', 20:24:22 INFO - 'cart']}, 20:24:22 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:24:22 INFO - 'talos_options': ['--disable-e10s'], 20:24:22 INFO - 'tests': ['tp5o']}, 20:24:22 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:24:22 INFO - 'tests': ['tp5o']}, 20:24:22 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:24:22 INFO - 'talos_options': ['--disable-e10s', 20:24:22 INFO - '--xperf_path', 20:24:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 20:24:22 INFO - 'tests': ['tp5n']}, 20:24:22 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:24:22 INFO - 'talos_options': ['--xperf_path', 20:24:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 20:24:22 INFO - 'tests': ['tp5n']}}, 20:24:22 INFO - 'talos.zip': {'path': '', 20:24:22 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 20:24:22 INFO - Running post-action listener: _resource_record_post_action 20:24:22 INFO - ##### 20:24:22 INFO - ##### Finished populate-webroot step (success) 20:24:22 INFO - ##### 20:24:22 INFO - ##### 20:24:22 INFO - ##### Running create-virtualenv step. 20:24:22 INFO - ##### 20:24:22 INFO - Running pre-action listener: _resource_record_pre_action 20:24:22 INFO - Running main action method: create_virtualenv 20:24:22 INFO - Creating virtualenv /builds/slave/test/build/venv 20:24:22 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 20:24:22 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 20:24:22 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 20:24:22 INFO - Using real prefix '/usr' 20:24:22 INFO - New python executable in /builds/slave/test/build/venv/bin/python 20:24:23 INFO - Installing distribute.............................................................................................................................................................................................done. 20:24:25 INFO - Installing pip.................done. 20:24:25 INFO - Return code: 0 20:24:25 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 20:24:25 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')]} 20:24:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:25 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')]} 20:24:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:25 INFO - Running command: ['/builds/slave/test/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/build 20:24:25 INFO - Copy/paste: /builds/slave/test/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 20:24:25 INFO - Using env: {'DISPLAY': ':0', 20:24:25 INFO - 'HOME': '/home/cltbld', 20:24:25 INFO - 'LANG': 'en_US.UTF-8', 20:24:25 INFO - 'LANGUAGE': 'en_US:en', 20:24:25 INFO - 'LOGNAME': 'cltbld', 20:24:25 INFO - 'MAIL': '/var/mail/cltbld', 20:24:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:25 INFO - 'MOZ_NO_REMOTE': '1', 20:24:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:25 INFO - 'NO_EM_RESTART': '1', 20:24:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:25 INFO - 'PWD': '/builds/slave/test', 20:24:25 INFO - 'SHELL': '/bin/bash', 20:24:25 INFO - 'SHLVL': '1', 20:24:25 INFO - 'TERM': 'linux', 20:24:25 INFO - 'TMOUT': '86400', 20:24:25 INFO - 'USER': 'cltbld', 20:24:25 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:25 INFO - '_': '/tools/buildbot/bin/python'} 20:24:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:25 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 20:24:25 INFO - Cleaning up... 20:24:25 INFO - Return code: 0 20:24:25 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 20:24:25 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')]} 20:24:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:25 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')]} 20:24:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/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>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:25 INFO - Running command: ['/builds/slave/test/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>=3.1.1'] in /builds/slave/test/build 20:24:25 INFO - Copy/paste: /builds/slave/test/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>=3.1.1 20:24:25 INFO - Using env: {'DISPLAY': ':0', 20:24:25 INFO - 'HOME': '/home/cltbld', 20:24:25 INFO - 'LANG': 'en_US.UTF-8', 20:24:25 INFO - 'LANGUAGE': 'en_US:en', 20:24:25 INFO - 'LOGNAME': 'cltbld', 20:24:25 INFO - 'MAIL': '/var/mail/cltbld', 20:24:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:25 INFO - 'MOZ_NO_REMOTE': '1', 20:24:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:25 INFO - 'NO_EM_RESTART': '1', 20:24:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:25 INFO - 'PWD': '/builds/slave/test', 20:24:25 INFO - 'SHELL': '/bin/bash', 20:24:25 INFO - 'SHLVL': '1', 20:24:25 INFO - 'TERM': 'linux', 20:24:25 INFO - 'TMOUT': '86400', 20:24:25 INFO - 'USER': 'cltbld', 20:24:25 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:25 INFO - '_': '/tools/buildbot/bin/python'} 20:24:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:25 INFO - Downloading/unpacking psutil>=3.1.1 20:24:25 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 20:24:25 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 20:24:25 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 20:24:25 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 20:24:25 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 20:24:25 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 20:24:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 20:24:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 20:24:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 20:24:27 INFO - Installing collected packages: psutil 20:24:27 INFO - Running setup.py install for psutil 20:24:27 INFO - building 'psutil._psutil_linux' extension 20:24:27 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 20:24:27 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 20:24:27 INFO - building 'psutil._psutil_posix' extension 20:24:27 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 20:24:27 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 20:24:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 20:24:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 20:24:27 INFO - Successfully installed psutil 20:24:27 INFO - Cleaning up... 20:24:28 INFO - Return code: 0 20:24:28 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 20:24:28 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')]} 20:24:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:28 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')]} 20:24:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:28 INFO - Running command: ['/builds/slave/test/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.3'] in /builds/slave/test/build 20:24:28 INFO - Copy/paste: /builds/slave/test/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.3 20:24:28 INFO - Using env: {'DISPLAY': ':0', 20:24:28 INFO - 'HOME': '/home/cltbld', 20:24:28 INFO - 'LANG': 'en_US.UTF-8', 20:24:28 INFO - 'LANGUAGE': 'en_US:en', 20:24:28 INFO - 'LOGNAME': 'cltbld', 20:24:28 INFO - 'MAIL': '/var/mail/cltbld', 20:24:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:28 INFO - 'MOZ_NO_REMOTE': '1', 20:24:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:28 INFO - 'NO_EM_RESTART': '1', 20:24:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:28 INFO - 'PWD': '/builds/slave/test', 20:24:28 INFO - 'SHELL': '/bin/bash', 20:24:28 INFO - 'SHLVL': '1', 20:24:28 INFO - 'TERM': 'linux', 20:24:28 INFO - 'TMOUT': '86400', 20:24:28 INFO - 'USER': 'cltbld', 20:24:28 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:28 INFO - '_': '/tools/buildbot/bin/python'} 20:24:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:28 INFO - Downloading/unpacking mozsystemmonitor==0.3 20:24:28 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 20:24:28 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 20:24:28 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 20:24:28 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 20:24:28 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 20:24:28 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 20:24:30 INFO - Downloading mozsystemmonitor-0.3.tar.gz 20:24:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 20:24:30 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 20:24:30 INFO - Installing collected packages: mozsystemmonitor 20:24:30 INFO - Running setup.py install for mozsystemmonitor 20:24:30 INFO - Successfully installed mozsystemmonitor 20:24:30 INFO - Cleaning up... 20:24:30 INFO - Return code: 0 20:24:30 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 20:24:30 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')]} 20:24:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:30 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')]} 20:24:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:30 INFO - retry: Calling run_command with args: [['/builds/slave/test/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==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:30 INFO - Running command: ['/builds/slave/test/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==2.5.1'] in /builds/slave/test/build 20:24:30 INFO - Copy/paste: /builds/slave/test/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==2.5.1 20:24:30 INFO - Using env: {'DISPLAY': ':0', 20:24:30 INFO - 'HOME': '/home/cltbld', 20:24:30 INFO - 'LANG': 'en_US.UTF-8', 20:24:30 INFO - 'LANGUAGE': 'en_US:en', 20:24:30 INFO - 'LOGNAME': 'cltbld', 20:24:30 INFO - 'MAIL': '/var/mail/cltbld', 20:24:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:30 INFO - 'MOZ_NO_REMOTE': '1', 20:24:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:30 INFO - 'NO_EM_RESTART': '1', 20:24:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:30 INFO - 'PWD': '/builds/slave/test', 20:24:30 INFO - 'SHELL': '/bin/bash', 20:24:30 INFO - 'SHLVL': '1', 20:24:30 INFO - 'TERM': 'linux', 20:24:30 INFO - 'TMOUT': '86400', 20:24:30 INFO - 'USER': 'cltbld', 20:24:30 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:30 INFO - '_': '/tools/buildbot/bin/python'} 20:24:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:30 INFO - Downloading/unpacking jsonschema==2.5.1 20:24:30 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 20:24:30 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 20:24:30 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 20:24:30 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 20:24:30 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 20:24:30 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 20:24:32 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 20:24:32 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 20:24:32 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 20:24:32 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 20:24:32 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 20:24:32 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 20:24:32 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 20:24:32 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 20:24:32 INFO - Downloading functools32-3.2.3-2.tar.gz 20:24:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 20:24:32 INFO - warning: no files found matching '*.txt' 20:24:32 INFO - no previously-included directories found matching 'build' 20:24:32 INFO - no previously-included directories found matching 'dist' 20:24:32 INFO - no previously-included directories found matching '.git*' 20:24:32 INFO - Installing collected packages: jsonschema, functools32 20:24:32 INFO - Running setup.py install for functools32 20:24:32 INFO - warning: no files found matching '*.txt' 20:24:32 INFO - no previously-included directories found matching 'build' 20:24:32 INFO - no previously-included directories found matching 'dist' 20:24:32 INFO - no previously-included directories found matching '.git*' 20:24:32 INFO - Successfully installed jsonschema functools32 20:24:32 INFO - Cleaning up... 20:24:32 INFO - Return code: 0 20:24:32 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 20:24: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')]} 20:24:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24: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')]} 20:24:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:32 INFO - Running command: ['/builds/slave/test/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/build 20:24:32 INFO - Copy/paste: /builds/slave/test/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 20:24:32 INFO - Using env: {'DISPLAY': ':0', 20:24:32 INFO - 'HOME': '/home/cltbld', 20:24:32 INFO - 'LANG': 'en_US.UTF-8', 20:24:32 INFO - 'LANGUAGE': 'en_US:en', 20:24:32 INFO - 'LOGNAME': 'cltbld', 20:24:32 INFO - 'MAIL': '/var/mail/cltbld', 20:24:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:32 INFO - 'MOZ_NO_REMOTE': '1', 20:24:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:32 INFO - 'NO_EM_RESTART': '1', 20:24:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:32 INFO - 'PWD': '/builds/slave/test', 20:24:32 INFO - 'SHELL': '/bin/bash', 20:24:32 INFO - 'SHLVL': '1', 20:24:32 INFO - 'TERM': 'linux', 20:24:32 INFO - 'TMOUT': '86400', 20:24:32 INFO - 'USER': 'cltbld', 20:24:32 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:32 INFO - '_': '/tools/buildbot/bin/python'} 20:24:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:33 INFO - Downloading/unpacking blobuploader==1.2.4 20:24:33 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 20:24:33 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 20:24:33 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 20:24:33 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 20:24:33 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 20:24:33 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 20:24:34 INFO - Downloading blobuploader-1.2.4.tar.gz 20:24:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 20:24:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 20:24:35 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 20:24:35 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 20:24:35 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 20:24:35 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 20:24:35 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 20:24:35 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 20:24:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 20:24:35 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 20:24:35 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 20:24:35 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 20:24:35 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 20:24:35 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 20:24:35 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 20:24:35 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 20:24:35 INFO - Downloading docopt-0.6.1.tar.gz 20:24:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 20:24:35 INFO - Installing collected packages: blobuploader, requests, docopt 20:24:35 INFO - Running setup.py install for blobuploader 20:24:35 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 20:24:35 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 20:24:35 INFO - Running setup.py install for requests 20:24:36 INFO - Running setup.py install for docopt 20:24:36 INFO - Successfully installed blobuploader requests docopt 20:24:36 INFO - Cleaning up... 20:24:36 INFO - Return code: 0 20:24:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:24:36 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')]} 20:24:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:36 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')]} 20:24:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/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 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 20:24:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/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 20:24:36 INFO - Using env: {'DISPLAY': ':0', 20:24:36 INFO - 'HOME': '/home/cltbld', 20:24:36 INFO - 'LANG': 'en_US.UTF-8', 20:24:36 INFO - 'LANGUAGE': 'en_US:en', 20:24:36 INFO - 'LOGNAME': 'cltbld', 20:24:36 INFO - 'MAIL': '/var/mail/cltbld', 20:24:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:36 INFO - 'MOZ_NO_REMOTE': '1', 20:24:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:36 INFO - 'NO_EM_RESTART': '1', 20:24:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:36 INFO - 'PWD': '/builds/slave/test', 20:24:36 INFO - 'SHELL': '/bin/bash', 20:24:36 INFO - 'SHLVL': '1', 20:24:36 INFO - 'TERM': 'linux', 20:24:36 INFO - 'TMOUT': '86400', 20:24:36 INFO - 'USER': 'cltbld', 20:24:36 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:36 INFO - '_': '/tools/buildbot/bin/python'} 20:24:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 20:24:36 INFO - Running setup.py (path:/tmp/pip-f27NgD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 20:24:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 20:24:36 INFO - Running setup.py (path:/tmp/pip-uaLLmw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 20:24:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 20:24:36 INFO - Running setup.py (path:/tmp/pip-DCpOhT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 20:24:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 20:24:36 INFO - Running setup.py (path:/tmp/pip-tt95VH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 20:24:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 20:24:36 INFO - Running setup.py (path:/tmp/pip-KUxehW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 20:24:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 20:24:36 INFO - Running setup.py (path:/tmp/pip-0B_LOY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 20:24:37 INFO - Running setup.py (path:/tmp/pip-u92LRL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 20:24:37 INFO - Running setup.py (path:/tmp/pip-pimAQ3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 20:24:37 INFO - Running setup.py (path:/tmp/pip-ppG_Ry-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 20:24:37 INFO - Running setup.py (path:/tmp/pip-BdlyoV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 20:24:37 INFO - Running setup.py (path:/tmp/pip-i26Zm0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 20:24:37 INFO - Running setup.py (path:/tmp/pip-W9Vd7M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 20:24:37 INFO - Running setup.py (path:/tmp/pip-5pO_fZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 20:24:37 INFO - Running setup.py (path:/tmp/pip-IiPKBW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 20:24:37 INFO - Running setup.py (path:/tmp/pip-NxrJoy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 20:24:37 INFO - Running setup.py (path:/tmp/pip-NGMDAa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 20:24:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 20:24:37 INFO - Running setup.py (path:/tmp/pip-wSt3F_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 20:24:37 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 20:24:37 INFO - Running setup.py install for manifestparser 20:24:37 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 20:24:37 INFO - Running setup.py install for mozcrash 20:24:38 INFO - Running setup.py install for mozdebug 20:24:38 INFO - Running setup.py install for mozdevice 20:24:38 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Installing dm script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Running setup.py install for mozfile 20:24:38 INFO - Running setup.py install for mozhttpd 20:24:38 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Running setup.py install for mozinfo 20:24:38 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Running setup.py install for mozInstall 20:24:38 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Running setup.py install for mozleak 20:24:38 INFO - Running setup.py install for mozlog 20:24:38 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Running setup.py install for moznetwork 20:24:38 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 20:24:38 INFO - Running setup.py install for mozprocess 20:24:39 INFO - Running setup.py install for mozprofile 20:24:39 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 20:24:39 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 20:24:39 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 20:24:39 INFO - Running setup.py install for mozrunner 20:24:39 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 20:24:39 INFO - Running setup.py install for mozscreenshot 20:24:39 INFO - Running setup.py install for moztest 20:24:39 INFO - Running setup.py install for mozversion 20:24:39 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 20:24:39 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 20:24:39 INFO - Cleaning up... 20:24:39 INFO - Return code: 0 20:24:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:24: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')]} 20:24:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24: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')]} 20:24:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/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 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 20:24:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/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 20:24:39 INFO - Using env: {'DISPLAY': ':0', 20:24:39 INFO - 'HOME': '/home/cltbld', 20:24:39 INFO - 'LANG': 'en_US.UTF-8', 20:24:39 INFO - 'LANGUAGE': 'en_US:en', 20:24:39 INFO - 'LOGNAME': 'cltbld', 20:24:39 INFO - 'MAIL': '/var/mail/cltbld', 20:24:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:39 INFO - 'MOZ_NO_REMOTE': '1', 20:24:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:39 INFO - 'NO_EM_RESTART': '1', 20:24:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:39 INFO - 'PWD': '/builds/slave/test', 20:24:39 INFO - 'SHELL': '/bin/bash', 20:24:39 INFO - 'SHLVL': '1', 20:24:39 INFO - 'TERM': 'linux', 20:24:39 INFO - 'TMOUT': '86400', 20:24:39 INFO - 'USER': 'cltbld', 20:24:39 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:39 INFO - '_': '/tools/buildbot/bin/python'} 20:24:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 20:24:39 INFO - Running setup.py (path:/tmp/pip-8PyEpJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 20:24:39 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 20:24:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 20:24:39 INFO - Running setup.py (path:/tmp/pip-dhXctg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 20:24:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 20:24:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 20:24:39 INFO - Running setup.py (path:/tmp/pip-34RtCk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 20:24:40 INFO - Running setup.py (path:/tmp/pip-Z3xszB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 20:24:40 INFO - Running setup.py (path:/tmp/pip-BHJFjg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 20:24:40 INFO - Running setup.py (path:/tmp/pip-0VZSKs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 20:24:40 INFO - Running setup.py (path:/tmp/pip-97Ejvc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 20:24:40 INFO - Running setup.py (path:/tmp/pip-TNKkXR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 20:24:40 INFO - Running setup.py (path:/tmp/pip-WBW7_S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 20:24:40 INFO - Running setup.py (path:/tmp/pip-WYYk5O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 20:24:40 INFO - Running setup.py (path:/tmp/pip-cCWDLc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 20:24:40 INFO - Running setup.py (path:/tmp/pip-Sik_re-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 20:24:40 INFO - Running setup.py (path:/tmp/pip-Jmv0rO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 20:24:40 INFO - Running setup.py (path:/tmp/pip-4XF5NL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 20:24:40 INFO - Running setup.py (path:/tmp/pip-Acb06D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 20:24:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 20:24:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 20:24:40 INFO - Running setup.py (path:/tmp/pip-OohFSz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 20:24:41 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 20:24:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 20:24:41 INFO - Running setup.py (path:/tmp/pip-C0o4WH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 20:24:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 20:24:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 20:24:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 20:24:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 20:24:41 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 20:24:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 20:24:41 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 20:24:41 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 20:24:41 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 20:24:41 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 20:24:41 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 20:24:41 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 20:24:41 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 20:24:42 INFO - Downloading blessings-1.6.tar.gz 20:24:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 20:24:43 INFO - Installing collected packages: blessings 20:24:43 INFO - Running setup.py install for blessings 20:24:43 INFO - Successfully installed blessings 20:24:43 INFO - Cleaning up... 20:24:43 INFO - Return code: 0 20:24:43 INFO - Done creating virtualenv /builds/slave/test/build/venv. 20:24:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 20:24:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 20:24:43 INFO - Reading from file tmpfile_stdout 20:24:43 INFO - Current package versions: 20:24:43 INFO - argparse == 1.2.1 20:24:43 INFO - blessings == 1.6 20:24:43 INFO - blobuploader == 1.2.4 20:24:43 INFO - docopt == 0.6.1 20:24:43 INFO - functools32 == 3.2.3-2 20:24:43 INFO - jsonschema == 2.5.1 20:24:43 INFO - manifestparser == 1.1 20:24:43 INFO - mozInstall == 1.12 20:24:43 INFO - mozcrash == 0.17 20:24:43 INFO - mozdebug == 0.1 20:24:43 INFO - mozdevice == 0.48 20:24:43 INFO - mozfile == 1.2 20:24:43 INFO - mozhttpd == 0.7 20:24:43 INFO - mozinfo == 0.9 20:24:43 INFO - mozleak == 0.1 20:24:43 INFO - mozlog == 3.2 20:24:43 INFO - moznetwork == 0.27 20:24:43 INFO - mozprocess == 0.22 20:24:43 INFO - mozprofile == 0.28 20:24:43 INFO - mozrunner == 6.11 20:24:43 INFO - mozscreenshot == 0.1 20:24:43 INFO - mozsystemmonitor == 0.3 20:24:43 INFO - moztest == 0.7 20:24:43 INFO - mozversion == 1.4 20:24:43 INFO - psutil == 3.1.1 20:24:43 INFO - requests == 1.2.3 20:24:43 INFO - wsgiref == 0.1.2 20:24:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:24:43 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')]} 20:24:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:43 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')]} 20:24:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/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 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/talos 20:24:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/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 20:24:43 INFO - Using env: {'DISPLAY': ':0', 20:24:43 INFO - 'HOME': '/home/cltbld', 20:24:43 INFO - 'LANG': 'en_US.UTF-8', 20:24:43 INFO - 'LANGUAGE': 'en_US:en', 20:24:43 INFO - 'LOGNAME': 'cltbld', 20:24:43 INFO - 'MAIL': '/var/mail/cltbld', 20:24:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:43 INFO - 'MOZ_NO_REMOTE': '1', 20:24:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:43 INFO - 'NO_EM_RESTART': '1', 20:24:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:43 INFO - 'PWD': '/builds/slave/test', 20:24:43 INFO - 'SHELL': '/bin/bash', 20:24:43 INFO - 'SHLVL': '1', 20:24:43 INFO - 'TERM': 'linux', 20:24:43 INFO - 'TMOUT': '86400', 20:24:43 INFO - 'USER': 'cltbld', 20:24:43 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:43 INFO - '_': '/tools/buildbot/bin/python'} 20:24:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 20:24:43 INFO - Cleaning up... 20:24:43 INFO - Return code: 0 20:24:43 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 20:24:43 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')]} 20:24:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:43 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')]} 20:24:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:43 INFO - Running command: ['/builds/slave/test/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/build 20:24:43 INFO - Copy/paste: /builds/slave/test/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 20:24:43 INFO - Using env: {'DISPLAY': ':0', 20:24:43 INFO - 'HOME': '/home/cltbld', 20:24:43 INFO - 'LANG': 'en_US.UTF-8', 20:24:43 INFO - 'LANGUAGE': 'en_US:en', 20:24:43 INFO - 'LOGNAME': 'cltbld', 20:24:43 INFO - 'MAIL': '/var/mail/cltbld', 20:24:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:43 INFO - 'MOZ_NO_REMOTE': '1', 20:24:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:43 INFO - 'NO_EM_RESTART': '1', 20:24:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:43 INFO - 'PWD': '/builds/slave/test', 20:24:43 INFO - 'SHELL': '/bin/bash', 20:24:43 INFO - 'SHLVL': '1', 20:24:43 INFO - 'TERM': 'linux', 20:24:43 INFO - 'TMOUT': '86400', 20:24:43 INFO - 'USER': 'cltbld', 20:24:43 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:43 INFO - '_': '/tools/buildbot/bin/python'} 20:24:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:43 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 20:24:43 INFO - Cleaning up... 20:24:43 INFO - Return code: 0 20:24:43 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 20:24:43 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')]} 20:24:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:24:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:43 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')]} 20:24:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:24:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:24:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7f2a70782f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f738a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2041a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 20:24:43 INFO - Running command: ['/builds/slave/test/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/build 20:24:43 INFO - Copy/paste: /builds/slave/test/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 20:24:43 INFO - Using env: {'DISPLAY': ':0', 20:24:43 INFO - 'HOME': '/home/cltbld', 20:24:43 INFO - 'LANG': 'en_US.UTF-8', 20:24:43 INFO - 'LANGUAGE': 'en_US:en', 20:24:43 INFO - 'LOGNAME': 'cltbld', 20:24:43 INFO - 'MAIL': '/var/mail/cltbld', 20:24:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:24:43 INFO - 'MOZ_NO_REMOTE': '1', 20:24:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:24:43 INFO - 'NO_EM_RESTART': '1', 20:24:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:24:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:24:43 INFO - 'PWD': '/builds/slave/test', 20:24:43 INFO - 'SHELL': '/bin/bash', 20:24:43 INFO - 'SHLVL': '1', 20:24:43 INFO - 'TERM': 'linux', 20:24:43 INFO - 'TMOUT': '86400', 20:24:43 INFO - 'USER': 'cltbld', 20:24:43 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:24:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:24:43 INFO - '_': '/tools/buildbot/bin/python'} 20:24:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:24:44 INFO - Downloading/unpacking flake8 20:24: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 20:24: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 20:24: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 20:24: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 20:24: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 20:24: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 20:24:45 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 20:24:45 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 20:24:45 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 20:24:45 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 20:24:45 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 20:24:45 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 20:24:45 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 20:24:45 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 20:24:46 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 20:24:46 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 20:24: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 20:24: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 20:24: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 20:24: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 20:24: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 20:24: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 20:24:46 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 20:24: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 20:24: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 20:24: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 20:24: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 20:24: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 20:24: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 20:24:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 20:24:46 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 20:24:46 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 20:24:46 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 20:24:46 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 20:24:46 INFO - no previously-included directories found matching 'docs/_build' 20:24:46 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 20:24:46 INFO - Running setup.py install for pep8 20:24:46 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 20:24:46 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 20:24:46 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 20:24:46 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 20:24:46 INFO - no previously-included directories found matching 'docs/_build' 20:24:46 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 20:24:46 INFO - Successfully installed flake8 mccabe pyflakes pep8 20:24:46 INFO - Cleaning up... 20:24:46 INFO - Return code: 0 20:24:46 INFO - Running post-action listener: _resource_record_post_action 20:24:46 INFO - Running post-action listener: _start_resource_monitoring 20:24:46 INFO - Starting resource monitoring. 20:24:46 INFO - ##### 20:24:46 INFO - ##### Finished create-virtualenv step (success) 20:24:46 INFO - ##### 20:24:46 INFO - ##### 20:24:46 INFO - ##### Running install step. 20:24:46 INFO - ##### 20:24:46 INFO - Running pre-action listener: _resource_record_pre_action 20:24:46 INFO - Running main action method: install 20:24:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 20:24:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 20:24:47 INFO - Reading from file tmpfile_stdout 20:24:47 INFO - Detecting whether we're running mozinstall >=1.0... 20:24:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 20:24:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 20:24:47 INFO - Reading from file tmpfile_stdout 20:24:47 INFO - Output received: 20:24:47 INFO - Usage: mozinstall [options] installer 20:24:47 INFO - Options: 20:24:47 INFO - -h, --help show this help message and exit 20:24:47 INFO - -d DEST, --destination=DEST 20:24:47 INFO - Directory to install application into. [default: 20:24:47 INFO - "/builds/slave/test"] 20:24:47 INFO - --app=APP Application being installed. [default: firefox] 20:24:47 INFO - mkdir: /builds/slave/test/build/application 20:24:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 20:24:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 20:25:04 INFO - Reading from file tmpfile_stdout 20:25:04 INFO - Output received: 20:25:04 INFO - /builds/slave/test/build/application/firefox/firefox 20:25:04 INFO - Running post-action listener: _resource_record_post_action 20:25:04 INFO - ##### 20:25:04 INFO - ##### Finished install step (success) 20:25:04 INFO - ##### 20:25:04 INFO - ##### 20:25:04 INFO - ##### Running run-tests step. 20:25:04 INFO - ##### 20:25:04 INFO - Running pre-action listener: _resource_record_pre_action 20:25:04 INFO - Running main action method: run_tests 20:25:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 20:25:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 20:25:04 INFO - Python 2.7.3 20:25:04 INFO - Return code: 0 20:25:04 INFO - grabbing minidump binary from tooltool 20:25:04 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')]} 20:25:04 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/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203ed00>, '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 0x203fab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203ff60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 20:25:04 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 20:25:04 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 20:25:04 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 20:25:04 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 20:25:04 INFO - Return code: 0 20:25:04 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 20:25:04 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 20:25:04 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 20:25:04 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 20:25:04 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 20:25:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 20:25:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 20:25:05 INFO - Return code: 0 20:25:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-054', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 20:25:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-054 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 20:25:05 INFO - Using env: {'DISPLAY': ':0', 20:25:05 INFO - 'HOME': '/home/cltbld', 20:25:05 INFO - 'LANG': 'en_US.UTF-8', 20:25:05 INFO - 'LANGUAGE': 'en_US:en', 20:25:05 INFO - 'LOGNAME': 'cltbld', 20:25:05 INFO - 'MAIL': '/var/mail/cltbld', 20:25:05 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 20:25:05 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 20:25:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:25:05 INFO - 'MOZ_NO_REMOTE': '1', 20:25:05 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 20:25:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:25:05 INFO - 'NO_EM_RESTART': '1', 20:25:05 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:25:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:25:05 INFO - 'PWD': '/builds/slave/test', 20:25:05 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 20:25:05 INFO - 'SHELL': '/bin/bash', 20:25:05 INFO - 'SHLVL': '1', 20:25:05 INFO - 'TERM': 'linux', 20:25:05 INFO - 'TMOUT': '86400', 20:25:05 INFO - 'USER': 'cltbld', 20:25:05 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551', 20:25:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:25:05 INFO - '_': '/tools/buildbot/bin/python'} 20:25:05 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-054', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 20:25:05 INFO - mozversion application_buildid: 20160614171307 20:25:05 INFO - mozversion application_changeset: cf14f77f4f1def6ad4822f5829d1a7d0f6f7948b 20:25:05 INFO - mozversion application_display_name: Nightly 20:25:05 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 20:25:05 INFO - mozversion application_name: Firefox 20:25:05 INFO - mozversion application_remotingname: firefox 20:25:05 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 20:25:05 INFO - mozversion application_vendor: Mozilla 20:25:05 INFO - mozversion application_version: 50.0a1 20:25:05 INFO - mozversion platform_buildid: 20160614171307 20:25:05 INFO - mozversion platform_changeset: cf14f77f4f1def6ad4822f5829d1a7d0f6f7948b 20:25:05 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 20:25:05 INFO - mozversion platform_version: 50.0a1 20:25:05 INFO - using testdate: 1465961105 20:25:05 INFO - actual date: 1465961105 20:25:05 INFO - starting webserver on 'localhost:49408' 20:25:05 INFO - SUITE-START | Running 2 tests 20:25:05 INFO - TEST-START | dromaeo_css 20:25:05 INFO - operating with platform_type : linux_ 20:25:05 INFO - Initialising browser for dromaeo_css test... 20:25:05 INFO - TEST-INFO | started process 12842 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2LmRbF/profile http://localhost:49408/getInfo.html) 20:25:10 INFO - PROCESS | 12842 | __metrics Screen width/height:1600/1200 20:25:10 INFO - PROCESS | 12842 | colorDepth:24 20:25:10 INFO - PROCESS | 12842 | Browser inner width/height: 1024/697 20:25:10 INFO - PROCESS | 12842 | __metrics 20:25:10 ERROR - PROCESS | 12842 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 20:25:11 INFO - TEST-INFO | 12842: exit 0 20:25:11 INFO - Browser initialized. 20:25:11 INFO - Running cycle 1/1 for dromaeo_css test... 20:25:11 INFO - TEST-INFO | started process 12961 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2LmRbF/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:25:23 INFO - PROCESS | 12961 | RSS: Main: 185237504 20:25:23 INFO - PROCESS | 12961 | 20:26:13 INFO - PROCESS | 12961 | 1465961173243 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] 20:28:21 INFO - PROCESS | 12961 | Cycle 1(1): loaded http://localhost:49408/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49408/tests/dromaeo/cssquery-ext.html) 20:28:22 INFO - PROCESS | 12961 | RSS: Main: 189005824 20:28:22 INFO - PROCESS | 12961 | 20:31:24 INFO - PROCESS | 12961 | Cycle 1(1): loaded http://localhost:49408/tests/dromaeo/cssquery-ext.html (next: http://localhost:49408/tests/dromaeo/cssquery-jquery.html) 20:31:25 INFO - PROCESS | 12961 | RSS: Main: 188010496 20:31:25 INFO - PROCESS | 12961 | 20:34:27 INFO - PROCESS | 12961 | Cycle 1(1): loaded http://localhost:49408/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49408/tests/dromaeo/cssquery-mootools.html) 20:34:27 INFO - PROCESS | 12961 | RSS: Main: 189390848 20:34:27 INFO - PROCESS | 12961 | 20:37:29 INFO - PROCESS | 12961 | Cycle 1(1): loaded http://localhost:49408/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49408/tests/dromaeo/cssquery-prototype.html) 20:37:30 INFO - PROCESS | 12961 | RSS: Main: 186974208 20:37:30 INFO - PROCESS | 12961 | 20:40:32 INFO - PROCESS | 12961 | Cycle 1(1): loaded http://localhost:49408/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49408/tests/dromaeo/cssquery-yui.html) 20:40:33 INFO - PROCESS | 12961 | RSS: Main: 189030400 20:40:33 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | Cycle 1(1): loaded http://localhost:49408/tests/dromaeo/cssquery-yui.html (next: http://localhost:49408/tests/dromaeo/cssquery-dojo.html) 20:43:36 INFO - PROCESS | 12961 | RSS: Main: 189775872 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | __start_tp_report 20:43:36 INFO - PROCESS | 12961 | _x_x_mozilla_page_load 20:43:36 INFO - PROCESS | 12961 | _x_x_mozilla_page_load_details 20:43:36 INFO - PROCESS | 12961 | |i|pagename|runs| 20:43:36 INFO - PROCESS | 12961 | |0;dojo.html;3096.4890793019154;3120.828354440506;3144.716975472207;3147.4964005759084;3163.493840985442;5401.91897121543;5454.127339625661;5476.75354609043;5482.23248745175;5486.396496385404;5377.381601115872;5377.516023557879;5422;5451.754671039803;5506.284183056207;4877.317175595411;4904.190808516591;4987.850364489053;5047.924281135786;5079.060373830835;735.0335581862666;4838.274258861164;4955.776990035439;5009.599232061426;5013.473585273548;5001.774920128603;5032.370953630796;5035.924461133104;5051.898962020776;5059.822906198284;5044.9495505045215;5049.64652474327;5059.16523773577;5069.847904562832;5077;4878.121938051149;4955.380577427822;4956.479569645171;4985.326980857574;5013.74656335916;5397.595180361489;5476.096444086721;5476.561875049986;5477.370102438231;5499.450054994509;5689.715514224272;5813.6802475863815;5840.620359676607;5862.062070068769;5909.23179986599;5736.856578585527;5742.54059675225;5743.942560574383;5896.64620122794;5921.822345329647;5339.439358867341;5417.485338892799;5421.457854214586;5424.213489044067;5444.455554444524;5874.236349274653;5889.411058894077;5891.440313170242;5950.761969521257;5953.613015154001;5720.313562372542;5757.453041961091;5798.449147330997;5813.3895940925595;5844.824655260264;5806.1581070744505;5811.709414529257;5818.854528636733;5839.532837373;5843.211166492469;5585.245991791137;5802.21670074543;5820.650760954356;5833.358330583633;5849.853753656193;5863.70681465925;5903.26209223847;5907.261592300963;5909.231799866076;5910.261217347832;4406.889827754332;4422.358757980075;4423.026934074498;4432.778361081933;4441.222786012435;3829.5596006459614;3844.0774214188395;3888.9027774305305;3891.8248678809523;3899.083715326896;5386.649867758583;5513.448655134534;5531.446855314436;5584.972075139598;5589.832305030855;5891;5942.910856337158;5944.4352786485215;5949.464548190597;5951;5443.8094666686475;5461.180822876521;5505.3393592768325;5514.779408823602;5553.861153471195;4867.878303042452;4914.65597408178;4916.877078073006;4931.222941296645;4971.925421118686;5889.793857214977;6001.4298641628975;6008.699565021731;6018.247719035121;6035.486983606354;5797.449242321973;5883.646981181143;5921.111833224878;5946.316173639913;5947.613405128653;6083.969580152071;6101.298350689727;6102.931986902363;6107.908381374372;6109.969450152721;5585.916211256753;5672.31932168126;5768.596198266081;5802.390748971297;5815.680137592473;5826.970865145647;5860.326062502696;5870.735816888336;5882.323532793784;5938.970305148447;5669.206311116364;5685.658860468385;5701.657900525982;5709.286339207599;5717.771289148387;5601.719914004365;5602.299712535933;5611.3266408031295;5672.177534257427;5691.800786972436;5561.332640083216;5588.497035266845;5607.383187849415;5609.27079479665;5613.073842815889;5628.634138780966;5665.093585026376;5668.914966275592;5707.714614269187;5714.085746280742;5516.641418307797;5532.1701744737;5548.500634942713;5559.861003474945;5632.690202038763 20:43:36 INFO - PROCESS | 12961 | |1;ext.html;577.232281066182;613.3590398034055;625.8935980883252;636.9745210191593;650.7104338569338;38578.421323680166;43133.7843310783;43311.35032974508;43337.13325733483;43389.13221735563;42897.35653965185;43417.7829110854;43455;43470.34794478086;43534.34698479525;8678.392512524142;8726.650933962666;8760.43057201283;8784.253338466238;8836.513991730451;8713.128687131268;8738.912610873906;8776.517291548962;8807.559622018905;8838.381313308071;8786.341024423162;8812.206901378875;8839.867401988975;8852.380333376666;8894.421862578944;8761;8818.911810881873;8870.246029087502;8879.955600222022;8890.911090889073;8710.912890871074;8768.254698350647;8810.163034511712;8842.027376988526;8900.955495222548;40887.1822563547;40916.18167636661;41028;41120.794396028126;41158.176836463106;3073.3699591583672;3413.0272872231294;3571.5714114306447;3655.4334078217917;4013.0769922917602;31396.529052064237;31454.685453145405;31942.083474991574;32086.35827283441;32244.193895152574;4087.2234275487563;4160.812763425653;4209.5790420957965;4349.978250108729;4351.891202719926;301310;304133;304741;305075.47462262766;306542;36190.8190459046;36232.63767362293;36466.08834779152;36473.27053458916;36498.27003459916;37471.81264093662;38338.42492362617;38368.232635347136;40043.599564003984;40153.39769903454;16080.276387562588;16225.107619081064;16247.756283655755;16257.18714064292;16291.511254662379;12200.267983920992;12247.265164090182;12278.263304201777;12303.261804291593;12403.565875194505;19435.347995420547;19532.80467195338;19539.316123935594;19764.90117549403;19882.204711811653;7000.369966703021;7018.684159212848;7031.296870312928;7141.96429017862;7299.4525410594415;844.2907957315884;926.9443833370019;927.6150397584927;945.5272363818091;982.8820541535061;31608.841955790074;32336.353272934408;32741.67258327434;32864;33049.3390132196;1000.2398177385239;1071.089573862211;1125.6848082536903;1150.2006105756586;1159.2059439284117;16779.832201677826;16840.494785156465;16948.661026779395;16971.15144242783;17191.656166876593;543545;550207;553045;553419;553575;57876.4212357871;59064.70467647634;59252.703736481904;59378.70310648505;59564.40435595675;1350.7838745800625;1388.1185447240873;1391.6421776161899;1404.4101477379525;1408.0354956854587;29547.704522954496;30808;30839.38321233518;31003.224919377197;31133.8443307782;49806.25290620716;50122.749386252835;50135.49864501308;50146;50219;424486;431375;432845;433129;435035;28742.281442964093;29109.70890291155;29407.11778646644;29493;29549.409011820073;47530.28704569365;48120.27819582639;48744.26883596678;49269.75365123151;50058.49941500538;39684;41758.75618149293;42013;42477.57522424736;42505.14989700127;40533.59466405298;40671.59328406678;40743.38884916788;41860.58139418567;42080;40104.197916042096;40492.595074048884;41108.38337425001;41330.586694132675;41743.7912810434;34867.4769878447;36139.45790813088;36722.08194795151;36833;36901;27975.860120699268;28245.57631635486;28247.43505129845;28626.856865715537;28685.569716453854 20:43:36 INFO - PROCESS | 12961 | |2;jquery.html;396.40539191213173;411.3074697619297;413.18396167569034;415.67369614852345;428.42163079842214;18762.718559221623;19706.310279140234;19750;20195.697064544045;20586.382408527767;16971.406000789975;17191.484255472325;17617.383391581297;17662.470125896212;17758.46724598261;5620.690862002599;5631.1271752878365;5807.912881306784;5959.255093113361;5982.042873140298;5902.675352855591;5906.350301466835;5949.553783466257;5966.194563733906;5973.611715238518;5924.792632257871;5945.672987985659;5963.910541341862;5972.283326000865;6020.698965051752;5872.7063646817705;5963.075723262901;5975.014122669776;6010.188624535675;6010.36891126432;5727.341355744101;5799.18811366409;5820.621659592113;5838.6204896682;5845.7369418376275;14151.716965660733;14196.858031419657;14515.637109072251;14554.636134096627;14686.485972991;2293.6788849561076;2367.822413319008;2575.2775340006915;2620.816542842002;2898.2609434594256;10076.596936122547;10301.072903438651;10353.327033742782;10371.0666040056;10419.270651054429;1900.277894400133;1935.4870959195825;1953.4823271832975;2035.2164416699677;2048.7541495020546;79622;83267.5836620819;83839;83926.38404887728;85687.57156214179;10975.50610222542;11120.944395277971;11132.833007504894;11154.721131971603;11411.885881141083;15815.525534233991;15916;15939.521814345357;15968.764372987791;15985.200739963188;8248.340132789363;8642.697505587274;8675.826483470295;8747.825043499095;8782.692605758768;8123.675052997932;8189.50862948225;8198.877016844752;8308.459950103224;8437.198466145706;4848.10310092627;4898.848770538921;4935.580475659537;4963.329950456714;5070.41690205631;1982.5241941933832;2054.5377290109905;2066.9896650516653;2069.5757369739167;2071.7513898331995;910.517425764346;975.0347156315197;1031.7626945802508;1050.1756121444782;1050.3015494696094;18995.335163269217;19036.42890713281;19058.714119288223;19384.80615193858;19723.211071557263;1007.6725064354114;1031.7317497450717;1045.2839804733783;1064.499685147979;1090.4166271045112;10223.437710925822;11035.558577656964;11047.392393418439;11153.275037122561;11173.441327933733;420688;422237;422585;423801;429258.8537057295;54517.72741136269;68556;91654.54172729094;93370;93671;971.6987733802544;995.571904081252;996.7408473796866;1005.7385079879284;1014.8173328800739;17557.297708091533;17896.91051544734;17921.28314867391;17923.73114403259;18349.908250458662;40701.389479157246;41476;41659.7917010413;42353.152936941704;42740.78629606832;57889.71055144697;59480.40519594922;59647.40352596592;59800.40199598122;60890.695546523755;8770.522434539922;8841.381103322705;8954.910450895668;9003.81992360136;9027.4132181408;9663.565139568596;9906.455144967096;9975.45135017581;9978.201743860329;9978.451185184595;8795.736127915918;8986.415882967585;9112.088791120836;9215.723528294162;9267.67563135287;8846.071162527842;9001.864972025294;9019.278457723236;9177.21993630549;9215.170634642915;8985.775355616162;9188.897332320164;9467.715968520955;9498.09768072032;9579.425234485952;13042.217466952014;13553.86446135526;13643.86356136426;13683.794743078663;13763.243021633907;12704.6823829405;13013.154144980546;13069.803952940523;13115.737685246433;13321.733565328834 20:43:36 INFO - PROCESS | 12961 | |3;mootools.html;1469.2727100085456;1495.5588101510054;1594.6172918499556;1748.99432826125;1776.3871464344804;8043.798905027377;8620.956895215522;8820.691275805348;9237.214836738876;9244.907550924489;9038.954805225982;9060.592273347698;9127.634894604207;9144.451332920029;9151.725448236546;2352.6471029345607;2363.1492662641435;2395.6765836612094;2397.9160729374476;2404.5551572959057;2356.22244659262;2382.523495300938;2410.0721222329444;2410.301012706313;2412.6501657259687;2375.489269806991;2390.0320370249988;2395.4490467192554;2437.19572541061;2438.061346381647;2287.2680742162515;2315.7684231576877;2323.9419014524688;2325.3953971967326;2327.034280773477;2323.5701395241767;2342.426105604121;2346.0615753698485;2346.2257455039794;2352.3413444235644;9036.954815225947;9198.310126740522;9208.3093767967;9214.354995150343;9217.723468295962;5236.371635403738;5327.946720532823;5347.598930080259;5379.462053794628;5380.677159370451;3340.749443791701;3394.253264281854;3458.792472451661;3465.6014558325865;3490.8603655853735;1230.1819290172025;1243.9378031098408;1248.3882897380217;1259.3325537465157;1269.7206614544878;12959.67600809978;12961.15752476086;12967.22196668203;12975.351232438341;12991.870081299161;4669.832541864534;4677.76611169447;4760.166970780099;4776.402949631296;4924.162892308316;10753.139748820233;10874.891251087387;10887.564497420015;10924.197507411189;10954.671359859218;5426.186072089218;5427.457254274541;5465.344158700981;5502.724863756876;5506.421825708323;4375.321825117112;4747.098051370298;4905.901881962341;4907.975460122677;5058.772355244023;4048.9077952369917;4081.755094694328;4143;4156.501219853576;4205.158968206371;1324.4635922451423;1339.8258226430696;1340.537514557476;1343.5499107798996;1344.435337158396;838.1283465196128;983.4836710726926;1003.6988903328972;1008.5763979128784;1016.4257194685127;6179.660118693425;6260.780872669435;6302.306746257908;6339.873202535923;6417.839554011187;470.49656867151816;471.0296788615395;479.4941336889615;482.6187312023532;483.42713884047515;4337.783110844445;4452.554744525586;4458.977705111453;4493.28107502798;4576.405067341224;10866.293690910225;11246.775064498828;11295.322280663186;11313.264637798517;11361.829572556418;11014.229003969645;11303.886961130447;11304.943475282571;11440;11478.19652624325;8294.129116442928;8383.95808020956;8457.238848503664;8481.618327175293;8530.616122274512;6025.126356678345;6074.331823499323;6162.969185154046;6235.251769787473;6292.528060395397;10425.791484170122;10446.320989135682;10467.476626168509;10524.368537887445;10569.365838049742;10111.544980476043;10206.897931020594;10621.840672389766;10651.946740266249;10688.625898093529;7322.0847394075745;7747.72882949094;7909.564973926259;7981.680732770624;8428;8850.690225842065;8861.24679402258;8862.689805857022;8872.73381798547;8939.150780675825;7627.542347458948;7644.426667999811;7764.495307804975;7774.6890124394395;7983.20167983197;7529.774106776806;7591.240875912365;7626.771196864103;7667.731629392944;7707.190744971697;7129.857402852018;7163;7219.747308844166;7222.74720384784;7253.310935461122;5262.447443018428;5367.838964831061;5394.514493695587;5445.50990410865;5554.444555544414;5350.892982140257;5480.780768769205;5517.44825517445;5532.059549876451;5581.190727344431 20:43:36 INFO - PROCESS | 12961 | |4;prototype.html;320.57203633149743;326.3798782313604;327.87212986935083;329.61599736307204;329.96040475142985;5672.347680016799;5690.971545142279;5698.715064246787;5713.885722285552;5760.251167348244;5553.416891226424;5591.1054231323;5613.326400831906;5616.859578510539;5634.098544232924;4150.605692459219;4208.463910672613;4275.5510671379525;4308.526062133178;4332.220200363933;4320.719153255044;4321.783910804463;4350.521442641307;4367.497737760166;4384.276594361926;4265.637420819234;4344.695871289011;4350.390945267665;4384.408104905829;4388.780560971939;4173.686973476986;4253.21315556623;4263.829446822124;4267.521295437305;4305.461817272841;3733.328000959826;3773.5660399054186;3796.316663000659;3799.9740070180897;3808.6572208501366;5474.589405794582;5487;5491;5501.807436739695;5513.807016754395;4875.878103047452;4940.2342636891335;4954.752262386903;4964.379452568429;4997.875053123665;5690.658560486384;5748.396418376094;5839.941600583982;5894.528437724972;5911.733971971272;4234.809433575497;4242.857357034709;4247.299195632717;4252.213340532012;4255.063885945087;5923.378045305224;5935.465808077293;6034.034554471264;6102.328743838174;6142.775043102407;4217.493900731932;4219.177260434186;4228.238916994909;4258.276093064186;4279.87160385189;4301.505326887385;4309.418228539107;4327.32926396409;4328.632066274402;4353.281708518122;4854.975725121351;4912.606991440676;4954.950450495521;4960.875978100504;5007.84976450707;5913.349531551526;5914.408559144051;5928.911066334009;5934.347221805598;5966.6121702090095;1476.4610917015211;1504.4207979927808;1505.6160679026777;1508.1478964385087;1519.4605914900271;946.8059047895165;981.7005813227034;1005.4671024357102;1033.7002269341806;1033.7260625934134;5593.356763972195;5593.916091258634;5595.328560572757;5631.549476041907;5657.60396772222;5906.611946192641;5909.940900591025;5911.822645320647;5950.5239580834295;6016.42843929826;5421.942721169334;5620.409856965041;5710.71446427677;5711.314642242957;5727.341355744143;3218.6781321867625;3234.725048370915;3237.838108094633;3246.253361726816;3250.8049517029053;6132.233470816148;6192.102145188923;6256.499480041586;6278.116565030473;6282.994720844643;6180.381961803873;6183.165272688219;6186;6189.412005859436;6197.225346831646;6083.300420451705;6222.688865556704;6226.315105338409;6255.74977000924;6265.530085243625;5971.313298970674;5982.055831854577;5993;6018.3680713524445;6022.1870047543025;5915.615484993462;5917.37867523921;5929.99190137669;5946.316173640087;5958.463738263577;6072.362401947732;6143.907841382294;6214.886938440952;6247.156633854372;6270.15352927349;4290.721103128287;4297.474396589166;4317.7193482423545;4322.330038843984;4333.331667308046;5805.3614102447855;6094.939050609614;6114.357992410911;6142.539309551712;6144.508439324933;5859.853503662443;5874.267091208189;5916.467517923407;5925.585209035498;5927.347991720821;5832.708364581838;5840.678762668094;5853.94146058534;5857.765689372377;5875.73559189846;5510;5749.338826035059;5755.5971082025535;5768.884622307614;5785.363610002981;5837.474627283565;5900.498457630978;5909.497692696169;5926.585139040399;5939.613925094855;5676.659400435987;5759.222504961776;5778.508826749773;5781.94218057814;5829.737661805314 20:43:36 INFO - PROCESS | 12961 | |5;yui.html;731.9377852882504;757.5303311946594;778.3267473635303;791.9010123734533;809.5587904591997;13942.093763905339;15140.167290799001;15466.22668866555;15481.922590387032;15514.767278490817;14226.92886535566;14308.71382572348;14395.496157634485;14446.277686115678;14671.119732816038;824.0276473760974;830.3066939105854;836.2849763452252;837.2464781696491;837.4807619276027;798.5687728626564;824.3158178711685;824.4270232188632;826.3141592478229;828.0601517277903;870.503812826689;870.6212797433105;870.8127752533204;874.3049275825703;876.3952872517974;863.5897948474455;864.4597126795753;872.8167084912176;873.9563021848913;874.4971641306274;625.6840295650667;629.8614304852925;631.2582715309538;631.4916492223758;636.7834936121694;14513.854861451462;14515.274236288249;14532.128072315694;14535.90980676443;14545.054571452822;12871.549495767604;12876.484940602364;12952.417141228667;12993;13415.128016678884;10682.359058456439;10730.409827459487;11081.390523521202;11238.100951923827;11391.430428478625;3641.1625326174862;3735.364987952055;3760.9623903760885;3763.9623603764157;3921.450996860442;81366.18633813705;83299.5835020827;83379;83450;83852.99999999939;10254.58981640726;10271;10322.967703229617;10342.431166285776;10406.687799366031;20502.487437814176;20659.17363305451;20692.275770348268;20760.896195518926;20839.8958005209;7408.481406301507;8306.210909963665;8308.70919517814;8400.747977560683;8496.277816385553;4595.813300683845;4633.8841528961375;4724.267738500538;4757.976210118927;4897.7795999180125;3296.3736889991305;3299.5215693724754;3347.7489188310974;3351.8324083795715;3420.2304481491965;571.6998575747682;575.1401654526426;577.5697105656313;595.3510673366052;602.3374288282942;616.3713012727083;627.7740013595102;661.8312330355728;687.8727435424463;712.1916624631081;9151.63393464254;10071.395716257048;10151.168661459516;10414.854366019732;10760.246782725135;585.9062549992066;634.4702173685025;662.9734810607522;742.9702811887464;745.2584678245072;4862.896102736171;5047.924281135786;5070.467600901926;5086;5094.319833385748;113879;117091.41454292844;117698;118775;119004;88638;90285;102421.48789256155;103230.48384758028;104100;57879.42120578909;83762;89721.65417518742;90955.54522227478;91441;10188.949055254676;10230.181585473294;10250.794984100126;10328.793424131325;10334.173266138841;38181.23637527289;39229;51771.482285176666;52131.21803172879;52758;54331;74044.62977685076;74848.25151748412;74920.62539687267;75241.62379188069;11945;12653.042874483524;12776.680582985127;12827.486900523874;13332.466701331838;13554.457821687416;13583.660408489866;13859.722805543632;13870.167789932637;14455.566333010027;13133.802992954923;13280.867191327963;13621.863781362455;14129.222892740587;14499.637509062359;12257.325847078497;13114.409851556893;13742.381592828548;14415.855841441451;14442;12081.818772718592;12755.681107972376;12890.613281601567;13006.674833129247;13117.34413279313;11263.605773797877;11547.364894930859;11574.305541667527;11944.462499187384;12105;11028.699458004043;11042.503087361249;11330;11351.37567433799;11531.8270225945 20:43:36 INFO - PROCESS | 12961 | __end_tp_report 20:43:36 INFO - PROCESS | 12961 | __start_cc_report 20:43:36 INFO - PROCESS | 12961 | _x_x_mozilla_cycle_collect,365 20:43:36 INFO - PROCESS | 12961 | __end_cc_report 20:43:36 INFO - PROCESS | 12961 | __startTimestamp1465962216315__endTimestamp 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | ------- Summary: start ------- 20:43:36 INFO - PROCESS | 12961 | Number of tests: 6 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | [#0] dojo.html Cycles:165 Average:5387.89 Median:5601.72 stddev:724.32 (12.9%) stddev-sans-first:703.88 20:43:36 INFO - PROCESS | 12961 | Values: 3096.5 3120.8 3144.7 3147.5 3163.5 5401.9 5454.1 5476.8 5482.2 5486.4 5377.4 5377.5 5422.0 5451.8 5506.3 4877.3 4904.2 4987.9 5047.9 5079.1 735.0 4838.3 4955.8 5009.6 5013.5 5001.8 5032.4 5035.9 5051.9 5059.8 5044.9 5049.6 5059.2 5069.8 5077.0 4878.1 4955.4 4956.5 4985.3 5013.7 5397.6 5476.1 5476.6 5477.4 5499.5 5689.7 5813.7 5840.6 5862.1 5909.2 5736.9 5742.5 5743.9 5896.6 5921.8 5339.4 5417.5 5421.5 5424.2 5444.5 5874.2 5889.4 5891.4 5950.8 5953.6 5720.3 5757.5 5798.4 5813.4 5844.8 5806.2 5811.7 5818.9 5839.5 5843.2 5585.2 5802.2 5820.7 5833.4 5849.9 5863.7 5903.3 5907.3 5909.2 5910.3 4406.9 4422.4 4423.0 4432.8 4441.2 3829.6 3844.1 3888.9 3891.8 3899.1 5386.6 5513.4 5531.4 5585.0 5589.8 5891.0 5942.9 5944.4 5949.5 5951.0 5443.8 5461.2 5505.3 5514.8 5553.9 4867.9 4914.7 4916.9 4931.2 4971.9 5889.8 6001.4 6008.7 6018.2 6035.5 5797.4 5883.6 5921.1 5946.3 5947.6 6084.0 6101.3 6102.9 6107.9 6110.0 5585.9 5672.3 5768.6 5802.4 5815.7 5827.0 5860.3 5870.7 5882.3 5939.0 5669.2 5685.7 5701.7 5709.3 5717.8 5601.7 5602.3 5611.3 5672.2 5691.8 5561.3 5588.5 5607.4 5609.3 5613.1 5628.6 5665.1 5668.9 5707.7 5714.1 5516.6 5532.2 5548.5 5559.9 5632.7 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | [#1] ext.html Cycles:180 Average:57974.51 Median:41068.19 stddev:117029.50 (285.0%) stddev-sans-first:117278.45 20:43:36 INFO - PROCESS | 12961 | Values: 577.2 613.4 625.9 637.0 650.7 38578.4 43133.8 43311.4 43337.1 43389.1 42897.4 43417.8 43455.0 43470.3 43534.3 8678.4 8726.7 8760.4 8784.3 8836.5 8713.1 8738.9 8776.5 8807.6 8838.4 8786.3 8812.2 8839.9 8852.4 8894.4 8761.0 8818.9 8870.2 8880.0 8890.9 8710.9 8768.3 8810.2 8842.0 8901.0 40887.2 40916.2 41028.0 41120.8 41158.2 3073.4 3413.0 3571.6 3655.4 4013.1 31396.5 31454.7 31942.1 32086.4 32244.2 4087.2 4160.8 4209.6 4350.0 4351.9 301310.0 304133.0 304741.0 305075.5 306542.0 36190.8 36232.6 36466.1 36473.3 36498.3 37471.8 38338.4 38368.2 40043.6 40153.4 16080.3 16225.1 16247.8 16257.2 16291.5 12200.3 12247.3 12278.3 12303.3 12403.6 19435.3 19532.8 19539.3 19764.9 19882.2 7000.4 7018.7 7031.3 7142.0 7299.5 844.3 926.9 927.6 945.5 982.9 31608.8 32336.4 32741.7 32864.0 33049.3 1000.2 1071.1 1125.7 1150.2 1159.2 16779.8 16840.5 16948.7 16971.2 17191.7 543545.0 550207.0 553045.0 553419.0 553575.0 57876.4 59064.7 59252.7 59378.7 59564.4 1350.8 1388.1 1391.6 1404.4 1408.0 29547.7 30808.0 30839.4 31003.2 31133.8 49806.3 50122.7 50135.5 50146.0 50219.0 424486.0 431375.0 432845.0 433129.0 435035.0 28742.3 29109.7 29407.1 29493.0 29549.4 47530.3 48120.3 48744.3 49269.8 50058.5 39684.0 41758.8 42013.0 42477.6 42505.1 40533.6 40671.6 40743.4 41860.6 42080.0 40104.2 40492.6 41108.4 41330.6 41743.8 34867.5 36139.5 36722.1 36833.0 36901.0 27975.9 28245.6 28247.4 28626.9 28685.6 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | [#2] jquery.html Cycles:180 Average:26667.02 Median:233077.08 stddev:70160.77 (30.1%) stddev-sans-first:70329.86 20:43:36 INFO - PROCESS | 12961 | Values: 396.4 411.3 413.2 415.7 428.4 18762.7 19706.3 19750.0 20195.7 20586.4 16971.4 17191.5 17617.4 17662.5 17758.5 5620.7 5631.1 5807.9 5959.3 5982.0 5902.7 5906.4 5949.6 5966.2 5973.6 5924.8 5945.7 5963.9 5972.3 6020.7 5872.7 5963.1 5975.0 6010.2 6010.4 5727.3 5799.2 5820.6 5838.6 5845.7 14151.7 14196.9 14515.6 14554.6 14686.5 2293.7 2367.8 2575.3 2620.8 2898.3 10076.6 10301.1 10353.3 10371.1 10419.3 1900.3 1935.5 1953.5 2035.2 2048.8 79622.0 83267.6 83839.0 83926.4 85687.6 10975.5 11120.9 11132.8 11154.7 11411.9 15815.5 15916.0 15939.5 15968.8 15985.2 8248.3 8642.7 8675.8 8747.8 8782.7 8123.7 8189.5 8198.9 8308.5 8437.2 4848.1 4898.8 4935.6 4963.3 5070.4 1982.5 2054.5 2067.0 2069.6 2071.8 910.5 975.0 1031.8 1050.2 1050.3 18995.3 19036.4 19058.7 19384.8 19723.2 1007.7 1031.7 1045.3 1064.5 1090.4 10223.4 11035.6 11047.4 11153.3 11173.4 420688.0 422237.0 422585.0 423801.0 429258.9 54517.7 68556.0 91654.5 93370.0 93671.0 971.7 995.6 996.7 1005.7 1014.8 17557.3 17896.9 17921.3 17923.7 18349.9 40701.4 41476.0 41659.8 42353.2 42740.8 57889.7 59480.4 59647.4 59800.4 60890.7 8770.5 8841.4 8954.9 9003.8 9027.4 9663.6 9906.5 9975.5 9978.2 9978.5 8795.7 8986.4 9112.1 9215.7 9267.7 8846.1 9001.9 9019.3 9177.2 9215.2 8985.8 9188.9 9467.7 9498.1 9579.4 13042.2 13553.9 13643.9 13683.8 13763.2 12704.7 13013.2 13069.8 13115.7 13321.7 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | [#3] mootools.html Cycles:180 Average:5983.05 Median:2574.13 stddev:3437.14 (133.5%) stddev-sans-first:3430.04 20:43:36 INFO - PROCESS | 12961 | Values: 1469.3 1495.6 1594.6 1749.0 1776.4 8043.8 8621.0 8820.7 9237.2 9244.9 9039.0 9060.6 9127.6 9144.5 9151.7 2352.6 2363.1 2395.7 2397.9 2404.6 2356.2 2382.5 2410.1 2410.3 2412.7 2375.5 2390.0 2395.4 2437.2 2438.1 2287.3 2315.8 2323.9 2325.4 2327.0 2323.6 2342.4 2346.1 2346.2 2352.3 9037.0 9198.3 9208.3 9214.4 9217.7 5236.4 5327.9 5347.6 5379.5 5380.7 3340.7 3394.3 3458.8 3465.6 3490.9 1230.2 1243.9 1248.4 1259.3 1269.7 12959.7 12961.2 12967.2 12975.4 12991.9 4669.8 4677.8 4760.2 4776.4 4924.2 10753.1 10874.9 10887.6 10924.2 10954.7 5426.2 5427.5 5465.3 5502.7 5506.4 4375.3 4747.1 4905.9 4908.0 5058.8 4048.9 4081.8 4143.0 4156.5 4205.2 1324.5 1339.8 1340.5 1343.5 1344.4 838.1 983.5 1003.7 1008.6 1016.4 6179.7 6260.8 6302.3 6339.9 6417.8 470.5 471.0 479.5 482.6 483.4 4337.8 4452.6 4459.0 4493.3 4576.4 10866.3 11246.8 11295.3 11313.3 11361.8 11014.2 11303.9 11304.9 11440.0 11478.2 8294.1 8384.0 8457.2 8481.6 8530.6 6025.1 6074.3 6163.0 6235.3 6292.5 10425.8 10446.3 10467.5 10524.4 10569.4 10111.5 10206.9 10621.8 10651.9 10688.6 7322.1 7747.7 7909.6 7981.7 8428.0 8850.7 8861.2 8862.7 8872.7 8939.2 7627.5 7644.4 7764.5 7774.7 7983.2 7529.8 7591.2 7626.8 7667.7 7707.2 7129.9 7163.0 7219.7 7222.7 7253.3 5262.4 5367.8 5394.5 5445.5 5554.4 5350.9 5480.8 5517.4 5532.1 5581.2 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | [#4] prototype.html Cycles:180 Average:4938.18 Median:5664.98 stddev:1459.49 (25.8%) stddev-sans-first:1421.84 20:43:36 INFO - PROCESS | 12961 | Values: 320.6 326.4 327.9 329.6 330.0 5672.3 5691.0 5698.7 5713.9 5760.3 5553.4 5591.1 5613.3 5616.9 5634.1 4150.6 4208.5 4275.6 4308.5 4332.2 4320.7 4321.8 4350.5 4367.5 4384.3 4265.6 4344.7 4350.4 4384.4 4388.8 4173.7 4253.2 4263.8 4267.5 4305.5 3733.3 3773.6 3796.3 3800.0 3808.7 5474.6 5487.0 5491.0 5501.8 5513.8 4875.9 4940.2 4954.8 4964.4 4997.9 5690.7 5748.4 5839.9 5894.5 5911.7 4234.8 4242.9 4247.3 4252.2 4255.1 5923.4 5935.5 6034.0 6102.3 6142.8 4217.5 4219.2 4228.2 4258.3 4279.9 4301.5 4309.4 4327.3 4328.6 4353.3 4855.0 4912.6 4955.0 4960.9 5007.8 5913.3 5914.4 5928.9 5934.3 5966.6 1476.5 1504.4 1505.6 1508.1 1519.5 946.8 981.7 1005.5 1033.7 1033.7 5593.4 5593.9 5595.3 5631.5 5657.6 5906.6 5909.9 5911.8 5950.5 6016.4 5421.9 5620.4 5710.7 5711.3 5727.3 3218.7 3234.7 3237.8 3246.3 3250.8 6132.2 6192.1 6256.5 6278.1 6283.0 6180.4 6183.2 6186.0 6189.4 6197.2 6083.3 6222.7 6226.3 6255.7 6265.5 5971.3 5982.1 5993.0 6018.4 6022.2 5915.6 5917.4 5930.0 5946.3 5958.5 6072.4 6143.9 6214.9 6247.2 6270.2 4290.7 4297.5 4317.7 4322.3 4333.3 5805.4 6094.9 6114.4 6142.5 6144.5 5859.9 5874.3 5916.5 5925.6 5927.3 5832.7 5840.7 5853.9 5857.8 5875.7 5510.0 5749.3 5755.6 5768.9 5785.4 5837.5 5900.5 5909.5 5926.6 5939.6 5676.7 5759.2 5778.5 5781.9 5829.7 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - PROCESS | 12961 | [#5] yui.html Cycles:180 Average:20533.28 Median:3386.03 stddev:30070.22 (888.1%) stddev-sans-first:30117.82 20:43:36 INFO - PROCESS | 12961 | Values: 731.9 757.5 778.3 791.9 809.6 13942.1 15140.2 15466.2 15481.9 15514.8 14226.9 14308.7 14395.5 14446.3 14671.1 824.0 830.3 836.3 837.2 837.5 798.6 824.3 824.4 826.3 828.1 870.5 870.6 870.8 874.3 876.4 863.6 864.5 872.8 874.0 874.5 625.7 629.9 631.3 631.5 636.8 14513.9 14515.3 14532.1 14535.9 14545.1 12871.5 12876.5 12952.4 12993.0 13415.1 10682.4 10730.4 11081.4 11238.1 11391.4 3641.2 3735.4 3761.0 3764.0 3921.5 81366.2 83299.6 83379.0 83450.0 83853.0 10254.6 10271.0 10323.0 10342.4 10406.7 20502.5 20659.2 20692.3 20760.9 20839.9 7408.5 8306.2 8308.7 8400.7 8496.3 4595.8 4633.9 4724.3 4758.0 4897.8 3296.4 3299.5 3347.7 3351.8 3420.2 571.7 575.1 577.6 595.4 602.3 616.4 627.8 661.8 687.9 712.2 9151.6 10071.4 10151.2 10414.9 10760.2 585.9 634.5 663.0 743.0 745.3 4862.9 5047.9 5070.5 5086.0 5094.3 113879.0 117091.4 117698.0 118775.0 119004.0 88638.0 90285.0 102421.5 103230.5 104100.0 57879.4 83762.0 89721.7 90955.5 91441.0 10188.9 10230.2 10250.8 10328.8 10334.2 38181.2 39229.0 51771.5 52131.2 52758.0 54331.0 74044.6 74848.3 74920.6 75241.6 11945.0 12653.0 12776.7 12827.5 13332.5 13554.5 13583.7 13859.7 13870.2 14455.6 13133.8 13280.9 13621.9 14129.2 14499.6 12257.3 13114.4 13742.4 14415.9 14442.0 12081.8 12755.7 12890.6 13006.7 13117.3 11263.6 11547.4 11574.3 11944.5 12105.0 11028.7 11042.5 11330.0 11351.4 11531.8 20:43:36 INFO - PROCESS | 12961 | -------- Summary: end -------- 20:43:36 INFO - PROCESS | 12961 | 20:43:36 INFO - TEST-INFO | 12961: exit 0 20:43:37 INFO - TEST-OK | dromaeo_css | took 1111602ms 20:43:37 INFO - TEST-START | kraken 20:43:37 INFO - operating with platform_type : linux_ 20:43:37 INFO - Initialising browser for kraken test... 20:43:37 INFO - TEST-INFO | started process 13192 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5O41U_/profile http://localhost:49408/getInfo.html) 20:43:41 INFO - PROCESS | 13192 | __metrics Screen width/height:1600/1200 20:43:41 INFO - PROCESS | 13192 | colorDepth:24 20:43:41 INFO - PROCESS | 13192 | Browser inner width/height: 1024/697 20:43:41 INFO - PROCESS | 13192 | __metrics 20:43:42 ERROR - PROCESS | 13192 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 20:43:43 INFO - TEST-INFO | 13192: exit 0 20:43:43 INFO - Browser initialized. 20:43:43 INFO - Running cycle 1/1 for kraken test... 20:43:43 INFO - TEST-INFO | started process 13312 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5O41U_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:43:55 INFO - PROCESS | 13312 | RSS: Main: 185552896 20:43:55 INFO - PROCESS | 13312 | 20:43:57 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49408/tests/kraken/driver.html?testName=audio-beat-detection) 20:43:58 INFO - PROCESS | 13312 | RSS: Main: 191406080 20:43:58 INFO - PROCESS | 13312 | 20:44:01 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49408/tests/kraken/driver.html?testName=audio-dft) 20:44:02 INFO - PROCESS | 13312 | RSS: Main: 190246912 20:44:02 INFO - PROCESS | 13312 | 20:44:04 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49408/tests/kraken/driver.html?testName=audio-fft) 20:44:05 INFO - PROCESS | 13312 | RSS: Main: 185724928 20:44:05 INFO - PROCESS | 13312 | 20:44:07 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49408/tests/kraken/driver.html?testName=audio-oscillator) 20:44:08 INFO - PROCESS | 13312 | RSS: Main: 185626624 20:44:08 INFO - PROCESS | 13312 | 20:44:10 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49408/tests/kraken/driver.html?testName=imaging-gaussian-blur) 20:44:11 INFO - PROCESS | 13312 | RSS: Main: 186236928 20:44:11 INFO - PROCESS | 13312 | 20:44:14 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49408/tests/kraken/driver.html?testName=imaging-darkroom) 20:44:15 INFO - PROCESS | 13312 | RSS: Main: 186724352 20:44:15 INFO - PROCESS | 13312 | 20:44:18 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49408/tests/kraken/driver.html?testName=imaging-desaturate) 20:44:19 INFO - PROCESS | 13312 | RSS: Main: 184238080 20:44:19 INFO - PROCESS | 13312 | 20:44:22 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49408/tests/kraken/driver.html?testName=json-parse-financial) 20:44:22 INFO - PROCESS | 13312 | RSS: Main: 185356288 20:44:22 INFO - PROCESS | 13312 | 20:44:24 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49408/tests/kraken/driver.html?testName=json-stringify-tinderbox) 20:44:24 INFO - PROCESS | 13312 | RSS: Main: 186048512 20:44:24 INFO - PROCESS | 13312 | 20:44:26 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49408/tests/kraken/driver.html?testName=stanford-crypto-aes) 20:44:27 INFO - PROCESS | 13312 | RSS: Main: 186347520 20:44:27 INFO - PROCESS | 13312 | 20:44:29 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49408/tests/kraken/driver.html?testName=stanford-crypto-ccm) 20:44:30 INFO - PROCESS | 13312 | RSS: Main: 186331136 20:44:30 INFO - PROCESS | 13312 | 20:44:32 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49408/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 20:44:33 INFO - PROCESS | 13312 | RSS: Main: 187027456 20:44:33 INFO - PROCESS | 13312 | 20:44:36 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49408/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 20:44:36 INFO - PROCESS | 13312 | RSS: Main: 187338752 20:44:36 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | Cycle 1(1): loaded http://localhost:49408/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49408/tests/kraken/driver.html?testName=ai-astar) 20:44:38 INFO - PROCESS | 13312 | RSS: Main: 187490304 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | __start_tp_report 20:44:38 INFO - PROCESS | 13312 | _x_x_mozilla_page_load 20:44:38 INFO - PROCESS | 13312 | _x_x_mozilla_page_load_details 20:44:38 INFO - PROCESS | 13312 | |i|pagename|runs| 20:44:38 INFO - PROCESS | 13312 | |0;ai-astar;114;106;112;111;110;112;111;110;110;111 20:44:38 INFO - PROCESS | 13312 | |1;audio-beat-detection;163;133;154;191;127;164;161;129;185;126 20:44:38 INFO - PROCESS | 13312 | |2;audio-dft;170;163;161;166;170;168;162;162;163;161 20:44:38 INFO - PROCESS | 13312 | |3;audio-fft;74;75;76;172;76;74;75;76;160;75 20:44:38 INFO - PROCESS | 13312 | |4;audio-oscillator;86;86;156;84;84;85;144;84;86;145 20:44:38 INFO - PROCESS | 13312 | |5;imaging-gaussian-blur;118;119;117;117;118;117;118;117;118;118 20:44:38 INFO - PROCESS | 13312 | |6;imaging-darkroom;148;147;150;148;147;148;147;148;146;147 20:44:38 INFO - PROCESS | 13312 | |7;imaging-desaturate;96;96;96;96;95;95;96;96;95;95 20:44:38 INFO - PROCESS | 13312 | |8;json-parse-financial;56;56;54;54;56;58;53;55;54;57 20:44:38 INFO - PROCESS | 13312 | |9;json-stringify-tinderbox;61;62;62;62;63;68;62;62;61;62 20:44:38 INFO - PROCESS | 13312 | |10;stanford-crypto-aes;79;81;85;87;82;86;81;81;113;80 20:44:38 INFO - PROCESS | 13312 | |11;stanford-crypto-ccm;125;145;123;126;127;125;122;123;138;124 20:44:38 INFO - PROCESS | 13312 | |12;stanford-crypto-pbkdf2;159;164;158;160;163;160;166;159;156;158 20:44:38 INFO - PROCESS | 13312 | |13;stanford-crypto-sha256-iterative;63;65;63;64;64;63;63;63;63;64 20:44:38 INFO - PROCESS | 13312 | __end_tp_report 20:44:38 INFO - PROCESS | 13312 | __start_cc_report 20:44:38 INFO - PROCESS | 13312 | _x_x_mozilla_cycle_collect,889 20:44:38 INFO - PROCESS | 13312 | __end_cc_report 20:44:38 INFO - PROCESS | 13312 | __startTimestamp1465962278535__endTimestamp 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | ------- Summary: start ------- 20:44:38 INFO - PROCESS | 13312 | Number of tests: 14 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#0] ai-astar Cycles:10 Average:110.70 Median:111.00 stddev:2.06 (1.9%) stddev-sans-first:1.80 20:44:38 INFO - PROCESS | 13312 | Values: 114.0 106.0 112.0 111.0 110.0 112.0 111.0 110.0 110.0 111.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#1] audio-beat-detection Cycles:10 Average:153.30 Median:162.00 stddev:23.88 (14.7%) stddev-sans-first:25.07 20:44:38 INFO - PROCESS | 13312 | Values: 163.0 133.0 154.0 191.0 127.0 164.0 161.0 129.0 185.0 126.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#2] audio-dft Cycles:10 Average:164.60 Median:164.50 stddev:3.60 (2.2%) stddev-sans-first:3.24 20:44:38 INFO - PROCESS | 13312 | Values: 170.0 163.0 161.0 166.0 170.0 168.0 162.0 162.0 163.0 161.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#3] audio-fft Cycles:10 Average:93.30 Median:75.00 stddev:38.43 (51.2%) stddev-sans-first:40.12 20:44:38 INFO - PROCESS | 13312 | Values: 74.0 75.0 76.0 172.0 76.0 74.0 75.0 76.0 160.0 75.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#4] audio-oscillator Cycles:10 Average:104.00 Median:84.50 stddev:30.76 (36.4%) stddev-sans-first:31.93 20:44:38 INFO - PROCESS | 13312 | Values: 86.0 86.0 156.0 84.0 84.0 85.0 144.0 84.0 86.0 145.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#5] imaging-gaussian-blur Cycles:10 Average:117.70 Median:118.00 stddev:0.67 (0.6%) stddev-sans-first:0.71 20:44:38 INFO - PROCESS | 13312 | Values: 118.0 119.0 117.0 117.0 118.0 117.0 118.0 117.0 118.0 118.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#6] imaging-darkroom Cycles:10 Average:147.60 Median:148.00 stddev:1.07 (0.7%) stddev-sans-first:1.13 20:44:38 INFO - PROCESS | 13312 | Values: 148.0 147.0 150.0 148.0 147.0 148.0 147.0 148.0 146.0 147.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.53 20:44:38 INFO - PROCESS | 13312 | Values: 96.0 96.0 96.0 96.0 95.0 95.0 96.0 96.0 95.0 95.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#8] json-parse-financial Cycles:10 Average:55.30 Median:56.00 stddev:1.57 (2.8%) stddev-sans-first:1.64 20:44:38 INFO - PROCESS | 13312 | Values: 56.0 56.0 54.0 54.0 56.0 58.0 53.0 55.0 54.0 57.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#9] json-stringify-tinderbox Cycles:10 Average:62.50 Median:62.00 stddev:2.01 (3.2%) stddev-sans-first:2.06 20:44:38 INFO - PROCESS | 13312 | Values: 61.0 62.0 62.0 62.0 63.0 68.0 62.0 62.0 61.0 62.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#10] stanford-crypto-aes Cycles:10 Average:85.50 Median:81.50 stddev:10.02 (12.3%) stddev-sans-first:10.35 20:44:38 INFO - PROCESS | 13312 | Values: 79.0 81.0 85.0 87.0 82.0 86.0 81.0 81.0 113.0 80.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#11] stanford-crypto-ccm Cycles:10 Average:127.80 Median:125.50 stddev:7.55 (6.0%) stddev-sans-first:7.94 20:44:38 INFO - PROCESS | 13312 | Values: 125.0 145.0 123.0 126.0 127.0 125.0 122.0 123.0 138.0 124.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:160.30 Median:160.00 stddev:3.09 (1.9%) stddev-sans-first:3.24 20:44:38 INFO - PROCESS | 13312 | Values: 159.0 164.0 158.0 160.0 163.0 160.0 166.0 159.0 156.0 158.0 20:44:38 INFO - PROCESS | 13312 | 20:44:38 INFO - PROCESS | 13312 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.50 Median:63.50 stddev:0.71 (1.1%) stddev-sans-first:0.73 20:44:38 INFO - PROCESS | 13312 | Values: 63.0 65.0 63.0 64.0 64.0 63.0 63.0 63.0 63.0 64.0 20:44:38 INFO - PROCESS | 13312 | -------- Summary: end -------- 20:44:38 INFO - PROCESS | 13312 | 20:44:39 INFO - TEST-INFO | 13312: exit 0 20:44:39 INFO - TEST-OK | kraken | took 62602ms 20:44:39 INFO - SUITE-END | took 1174s 20:44:39 INFO - Completed test suite (00:19:34) 20:44:39 INFO - javascript benchmark 20:44:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7269.382372894498, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3096.4890793019154, 3120.828354440506, 3144.716975472207, 3147.4964005759084, 3163.493840985442, 5401.91897121543, 5454.127339625661, 5476.75354609043, 5482.23248745175, 5486.396496385404, 5377.381601115872, 5377.516023557879, 5422.0, 5451.754671039803, 5506.284183056207, 4877.317175595411, 4904.190808516591, 4987.850364489053, 5047.924281135786, 5079.060373830835, 735.0335581862666, 4838.274258861164, 4955.776990035439, 5009.599232061426, 5013.473585273548, 5001.774920128603, 5032.370953630796, 5035.924461133104, 5051.898962020776, 5059.822906198284, 5044.9495505045215, 5049.64652474327, 5059.16523773577, 5069.847904562832, 5077.0, 4878.121938051149, 4955.380577427822, 4956.479569645171, 4985.326980857574, 5013.74656335916, 5397.595180361489, 5476.096444086721, 5476.561875049986, 5477.370102438231, 5499.450054994509, 5689.715514224272, 5813.6802475863815, 5840.620359676607, 5862.062070068769, 5909.23179986599, 5736.856578585527, 5742.54059675225, 5743.942560574383, 5896.64620122794, 5921.822345329647, 5339.439358867341, 5417.485338892799, 5421.457854214586, 5424.213489044067, 5444.455554444524, 5874.236349274653, 5889.411058894077, 5891.440313170242, 5950.761969521257, 5953.613015154001, 5720.313562372542, 5757.453041961091, 5798.449147330997, 5813.3895940925595, 5844.824655260264, 5806.1581070744505, 5811.709414529257, 5818.854528636733, 5839.532837373, 5843.211166492469, 5585.245991791137, 5802.21670074543, 5820.650760954356, 5833.358330583633, 5849.853753656193, 5863.70681465925, 5903.26209223847, 5907.261592300963, 5909.231799866076, 5910.261217347832, 4406.889827754332, 4422.358757980075, 4423.026934074498, 4432.778361081933, 4441.222786012435, 3829.5596006459614, 3844.0774214188395, 3888.9027774305305, 3891.8248678809523, 3899.083715326896, 5386.649867758583, 5513.448655134534, 5531.446855314436, 5584.972075139598, 5589.832305030855, 5891.0, 5942.910856337158, 5944.4352786485215, 5949.464548190597, 5951.0, 5443.8094666686475, 5461.180822876521, 5505.3393592768325, 5514.779408823602, 5553.861153471195, 4867.878303042452, 4914.65597408178, 4916.877078073006, 4931.222941296645, 4971.925421118686, 5889.793857214977, 6001.4298641628975, 6008.699565021731, 6018.247719035121, 6035.486983606354, 5797.449242321973, 5883.646981181143, 5921.111833224878, 5946.316173639913, 5947.613405128653, 6083.969580152071, 6101.298350689727, 6102.931986902363, 6107.908381374372, 6109.969450152721, 5585.916211256753, 5672.31932168126, 5768.596198266081, 5802.390748971297, 5815.680137592473, 5826.970865145647, 5860.326062502696, 5870.735816888336, 5882.323532793784, 5938.970305148447, 5669.206311116364, 5685.658860468385, 5701.657900525982, 5709.286339207599, 5717.771289148387, 5601.719914004365, 5602.299712535933, 5611.3266408031295, 5672.177534257427, 5691.800786972436, 5561.332640083216, 5588.497035266845, 5607.383187849415, 5609.27079479665, 5613.073842815889, 5628.634138780966, 5665.093585026376, 5668.914966275592, 5707.714614269187, 5714.085746280742, 5516.641418307797, 5532.1701744737, 5548.500634942713, 5559.861003474945, 5632.690202038763], "value": 5339.728737301271, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [577.232281066182, 613.3590398034055, 625.8935980883252, 636.9745210191593, 650.7104338569338, 38578.421323680166, 43133.7843310783, 43311.35032974508, 43337.13325733483, 43389.13221735563, 42897.35653965185, 43417.7829110854, 43455.0, 43470.34794478086, 43534.34698479525, 8678.392512524142, 8726.650933962666, 8760.43057201283, 8784.253338466238, 8836.513991730451, 8713.128687131268, 8738.912610873906, 8776.517291548962, 8807.559622018905, 8838.381313308071, 8786.341024423162, 8812.206901378875, 8839.867401988975, 8852.380333376666, 8894.421862578944, 8761.0, 8818.911810881873, 8870.246029087502, 8879.955600222022, 8890.911090889073, 8710.912890871074, 8768.254698350647, 8810.163034511712, 8842.027376988526, 8900.955495222548, 40887.1822563547, 40916.18167636661, 41028.0, 41120.794396028126, 41158.176836463106, 3073.3699591583672, 3413.0272872231294, 3571.5714114306447, 3655.4334078217917, 4013.0769922917602, 31396.529052064237, 31454.685453145405, 31942.083474991574, 32086.35827283441, 32244.193895152574, 4087.2234275487563, 4160.812763425653, 4209.5790420957965, 4349.978250108729, 4351.891202719926, 301310.0, 304133.0, 304741.0, 305075.47462262766, 306542.0, 36190.8190459046, 36232.63767362293, 36466.08834779152, 36473.27053458916, 36498.27003459916, 37471.81264093662, 38338.42492362617, 38368.232635347136, 40043.599564003984, 40153.39769903454, 16080.276387562588, 16225.107619081064, 16247.756283655755, 16257.18714064292, 16291.511254662379, 12200.267983920992, 12247.265164090182, 12278.263304201777, 12303.261804291593, 12403.565875194505, 19435.347995420547, 19532.80467195338, 19539.316123935594, 19764.90117549403, 19882.204711811653, 7000.369966703021, 7018.684159212848, 7031.296870312928, 7141.96429017862, 7299.4525410594415, 844.2907957315884, 926.9443833370019, 927.6150397584927, 945.5272363818091, 982.8820541535061, 31608.841955790074, 32336.353272934408, 32741.67258327434, 32864.0, 33049.3390132196, 1000.2398177385239, 1071.089573862211, 1125.6848082536903, 1150.2006105756586, 1159.2059439284117, 16779.832201677826, 16840.494785156465, 16948.661026779395, 16971.15144242783, 17191.656166876593, 543545.0, 550207.0, 553045.0, 553419.0, 553575.0, 57876.4212357871, 59064.70467647634, 59252.703736481904, 59378.70310648505, 59564.40435595675, 1350.7838745800625, 1388.1185447240873, 1391.6421776161899, 1404.4101477379525, 1408.0354956854587, 29547.704522954496, 30808.0, 30839.38321233518, 31003.224919377197, 31133.8443307782, 49806.25290620716, 50122.749386252835, 50135.49864501308, 50146.0, 50219.0, 424486.0, 431375.0, 432845.0, 433129.0, 435035.0, 28742.281442964093, 29109.70890291155, 29407.11778646644, 29493.0, 29549.409011820073, 47530.28704569365, 48120.27819582639, 48744.26883596678, 49269.75365123151, 50058.49941500538, 39684.0, 41758.75618149293, 42013.0, 42477.57522424736, 42505.14989700127, 40533.59466405298, 40671.59328406678, 40743.38884916788, 41860.58139418567, 42080.0, 40104.197916042096, 40492.595074048884, 41108.38337425001, 41330.586694132675, 41743.7912810434, 34867.4769878447, 36139.45790813088, 36722.08194795151, 36833.0, 36901.0, 27975.860120699268, 28245.57631635486, 28247.43505129845, 28626.856865715537, 28685.569716453854], "value": 19436.8195118813, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [396.40539191213173, 411.3074697619297, 413.18396167569034, 415.67369614852345, 428.42163079842214, 18762.718559221623, 19706.310279140234, 19750.0, 20195.697064544045, 20586.382408527767, 16971.406000789975, 17191.484255472325, 17617.383391581297, 17662.470125896212, 17758.46724598261, 5620.690862002599, 5631.1271752878365, 5807.912881306784, 5959.255093113361, 5982.042873140298, 5902.675352855591, 5906.350301466835, 5949.553783466257, 5966.194563733906, 5973.611715238518, 5924.792632257871, 5945.672987985659, 5963.910541341862, 5972.283326000865, 6020.698965051752, 5872.7063646817705, 5963.075723262901, 5975.014122669776, 6010.188624535675, 6010.36891126432, 5727.341355744101, 5799.18811366409, 5820.621659592113, 5838.6204896682, 5845.7369418376275, 14151.716965660733, 14196.858031419657, 14515.637109072251, 14554.636134096627, 14686.485972991, 2293.6788849561076, 2367.822413319008, 2575.2775340006915, 2620.816542842002, 2898.2609434594256, 10076.596936122547, 10301.072903438651, 10353.327033742782, 10371.0666040056, 10419.270651054429, 1900.277894400133, 1935.4870959195825, 1953.4823271832975, 2035.2164416699677, 2048.7541495020546, 79622.0, 83267.5836620819, 83839.0, 83926.38404887728, 85687.57156214179, 10975.50610222542, 11120.944395277971, 11132.833007504894, 11154.721131971603, 11411.885881141083, 15815.525534233991, 15916.0, 15939.521814345357, 15968.764372987791, 15985.200739963188, 8248.340132789363, 8642.697505587274, 8675.826483470295, 8747.825043499095, 8782.692605758768, 8123.675052997932, 8189.50862948225, 8198.877016844752, 8308.459950103224, 8437.198466145706, 4848.10310092627, 4898.848770538921, 4935.580475659537, 4963.329950456714, 5070.41690205631, 1982.5241941933832, 2054.5377290109905, 2066.9896650516653, 2069.5757369739167, 2071.7513898331995, 910.517425764346, 975.0347156315197, 1031.7626945802508, 1050.1756121444782, 1050.3015494696094, 18995.335163269217, 19036.42890713281, 19058.714119288223, 19384.80615193858, 19723.211071557263, 1007.6725064354114, 1031.7317497450717, 1045.2839804733783, 1064.499685147979, 1090.4166271045112, 10223.437710925822, 11035.558577656964, 11047.392393418439, 11153.275037122561, 11173.441327933733, 420688.0, 422237.0, 422585.0, 423801.0, 429258.8537057295, 54517.72741136269, 68556.0, 91654.54172729094, 93370.0, 93671.0, 971.6987733802544, 995.571904081252, 996.7408473796866, 1005.7385079879284, 1014.8173328800739, 17557.297708091533, 17896.91051544734, 17921.28314867391, 17923.73114403259, 18349.908250458662, 40701.389479157246, 41476.0, 41659.7917010413, 42353.152936941704, 42740.78629606832, 57889.71055144697, 59480.40519594922, 59647.40352596592, 59800.40199598122, 60890.695546523755, 8770.522434539922, 8841.381103322705, 8954.910450895668, 9003.81992360136, 9027.4132181408, 9663.565139568596, 9906.455144967096, 9975.45135017581, 9978.201743860329, 9978.451185184595, 8795.736127915918, 8986.415882967585, 9112.088791120836, 9215.723528294162, 9267.67563135287, 8846.071162527842, 9001.864972025294, 9019.278457723236, 9177.21993630549, 9215.170634642915, 8985.775355616162, 9188.897332320164, 9467.715968520955, 9498.09768072032, 9579.425234485952, 13042.217466952014, 13553.86446135526, 13643.86356136426, 13683.794743078663, 13763.243021633907, 12704.6823829405, 13013.154144980546, 13069.803952940523, 13115.737685246433, 13321.733565328834], "value": 9093.239132592676, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1469.2727100085456, 1495.5588101510054, 1594.6172918499556, 1748.99432826125, 1776.3871464344804, 8043.798905027377, 8620.956895215522, 8820.691275805348, 9237.214836738876, 9244.907550924489, 9038.954805225982, 9060.592273347698, 9127.634894604207, 9144.451332920029, 9151.725448236546, 2352.6471029345607, 2363.1492662641435, 2395.6765836612094, 2397.9160729374476, 2404.5551572959057, 2356.22244659262, 2382.523495300938, 2410.0721222329444, 2410.301012706313, 2412.6501657259687, 2375.489269806991, 2390.0320370249988, 2395.4490467192554, 2437.19572541061, 2438.061346381647, 2287.2680742162515, 2315.7684231576877, 2323.9419014524688, 2325.3953971967326, 2327.034280773477, 2323.5701395241767, 2342.426105604121, 2346.0615753698485, 2346.2257455039794, 2352.3413444235644, 9036.954815225947, 9198.310126740522, 9208.3093767967, 9214.354995150343, 9217.723468295962, 5236.371635403738, 5327.946720532823, 5347.598930080259, 5379.462053794628, 5380.677159370451, 3340.749443791701, 3394.253264281854, 3458.792472451661, 3465.6014558325865, 3490.8603655853735, 1230.1819290172025, 1243.9378031098408, 1248.3882897380217, 1259.3325537465157, 1269.7206614544878, 12959.67600809978, 12961.15752476086, 12967.22196668203, 12975.351232438341, 12991.870081299161, 4669.832541864534, 4677.76611169447, 4760.166970780099, 4776.402949631296, 4924.162892308316, 10753.139748820233, 10874.891251087387, 10887.564497420015, 10924.197507411189, 10954.671359859218, 5426.186072089218, 5427.457254274541, 5465.344158700981, 5502.724863756876, 5506.421825708323, 4375.321825117112, 4747.098051370298, 4905.901881962341, 4907.975460122677, 5058.772355244023, 4048.9077952369917, 4081.755094694328, 4143.0, 4156.501219853576, 4205.158968206371, 1324.4635922451423, 1339.8258226430696, 1340.537514557476, 1343.5499107798996, 1344.435337158396, 838.1283465196128, 983.4836710726926, 1003.6988903328972, 1008.5763979128784, 1016.4257194685127, 6179.660118693425, 6260.780872669435, 6302.306746257908, 6339.873202535923, 6417.839554011187, 470.49656867151816, 471.0296788615395, 479.4941336889615, 482.6187312023532, 483.42713884047515, 4337.783110844445, 4452.554744525586, 4458.977705111453, 4493.28107502798, 4576.405067341224, 10866.293690910225, 11246.775064498828, 11295.322280663186, 11313.264637798517, 11361.829572556418, 11014.229003969645, 11303.886961130447, 11304.943475282571, 11440.0, 11478.19652624325, 8294.129116442928, 8383.95808020956, 8457.238848503664, 8481.618327175293, 8530.616122274512, 6025.126356678345, 6074.331823499323, 6162.969185154046, 6235.251769787473, 6292.528060395397, 10425.791484170122, 10446.320989135682, 10467.476626168509, 10524.368537887445, 10569.365838049742, 10111.544980476043, 10206.897931020594, 10621.840672389766, 10651.946740266249, 10688.625898093529, 7322.0847394075745, 7747.72882949094, 7909.564973926259, 7981.680732770624, 8428.0, 8850.690225842065, 8861.24679402258, 8862.689805857022, 8872.73381798547, 8939.150780675825, 7627.542347458948, 7644.426667999811, 7764.495307804975, 7774.6890124394395, 7983.20167983197, 7529.774106776806, 7591.240875912365, 7626.771196864103, 7667.731629392944, 7707.190744971697, 7129.857402852018, 7163.0, 7219.747308844166, 7222.74720384784, 7253.310935461122, 5262.447443018428, 5367.838964831061, 5394.514493695587, 5445.50990410865, 5554.444555544414, 5350.892982140257, 5480.780768769205, 5517.44825517445, 5532.059549876451, 5581.190727344431], "value": 4706.142112322196, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [320.57203633149743, 326.3798782313604, 327.87212986935083, 329.61599736307204, 329.96040475142985, 5672.347680016799, 5690.971545142279, 5698.715064246787, 5713.885722285552, 5760.251167348244, 5553.416891226424, 5591.1054231323, 5613.326400831906, 5616.859578510539, 5634.098544232924, 4150.605692459219, 4208.463910672613, 4275.5510671379525, 4308.526062133178, 4332.220200363933, 4320.719153255044, 4321.783910804463, 4350.521442641307, 4367.497737760166, 4384.276594361926, 4265.637420819234, 4344.695871289011, 4350.390945267665, 4384.408104905829, 4388.780560971939, 4173.686973476986, 4253.21315556623, 4263.829446822124, 4267.521295437305, 4305.461817272841, 3733.328000959826, 3773.5660399054186, 3796.316663000659, 3799.9740070180897, 3808.6572208501366, 5474.589405794582, 5487.0, 5491.0, 5501.807436739695, 5513.807016754395, 4875.878103047452, 4940.2342636891335, 4954.752262386903, 4964.379452568429, 4997.875053123665, 5690.658560486384, 5748.396418376094, 5839.941600583982, 5894.528437724972, 5911.733971971272, 4234.809433575497, 4242.857357034709, 4247.299195632717, 4252.213340532012, 4255.063885945087, 5923.378045305224, 5935.465808077293, 6034.034554471264, 6102.328743838174, 6142.775043102407, 4217.493900731932, 4219.177260434186, 4228.238916994909, 4258.276093064186, 4279.87160385189, 4301.505326887385, 4309.418228539107, 4327.32926396409, 4328.632066274402, 4353.281708518122, 4854.975725121351, 4912.606991440676, 4954.950450495521, 4960.875978100504, 5007.84976450707, 5913.349531551526, 5914.408559144051, 5928.911066334009, 5934.347221805598, 5966.6121702090095, 1476.4610917015211, 1504.4207979927808, 1505.6160679026777, 1508.1478964385087, 1519.4605914900271, 946.8059047895165, 981.7005813227034, 1005.4671024357102, 1033.7002269341806, 1033.7260625934134, 5593.356763972195, 5593.916091258634, 5595.328560572757, 5631.549476041907, 5657.60396772222, 5906.611946192641, 5909.940900591025, 5911.822645320647, 5950.5239580834295, 6016.42843929826, 5421.942721169334, 5620.409856965041, 5710.71446427677, 5711.314642242957, 5727.341355744143, 3218.6781321867625, 3234.725048370915, 3237.838108094633, 3246.253361726816, 3250.8049517029053, 6132.233470816148, 6192.102145188923, 6256.499480041586, 6278.116565030473, 6282.994720844643, 6180.381961803873, 6183.165272688219, 6186.0, 6189.412005859436, 6197.225346831646, 6083.300420451705, 6222.688865556704, 6226.315105338409, 6255.74977000924, 6265.530085243625, 5971.313298970674, 5982.055831854577, 5993.0, 6018.3680713524445, 6022.1870047543025, 5915.615484993462, 5917.37867523921, 5929.99190137669, 5946.316173640087, 5958.463738263577, 6072.362401947732, 6143.907841382294, 6214.886938440952, 6247.156633854372, 6270.15352927349, 4290.721103128287, 4297.474396589166, 4317.7193482423545, 4322.330038843984, 4333.331667308046, 5805.3614102447855, 6094.939050609614, 6114.357992410911, 6142.539309551712, 6144.508439324933, 5859.853503662443, 5874.267091208189, 5916.467517923407, 5925.585209035498, 5927.347991720821, 5832.708364581838, 5840.678762668094, 5853.94146058534, 5857.765689372377, 5875.73559189846, 5510.0, 5749.338826035059, 5755.5971082025535, 5768.884622307614, 5785.363610002981, 5837.474627283565, 5900.498457630978, 5909.497692696169, 5926.585139040399, 5939.613925094855, 5676.659400435987, 5759.222504961776, 5778.508826749773, 5781.94218057814, 5829.737661805314], "value": 4466.001404257842, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [731.9377852882504, 757.5303311946594, 778.3267473635303, 791.9010123734533, 809.5587904591997, 13942.093763905339, 15140.167290799001, 15466.22668866555, 15481.922590387032, 15514.767278490817, 14226.92886535566, 14308.71382572348, 14395.496157634485, 14446.277686115678, 14671.119732816038, 824.0276473760974, 830.3066939105854, 836.2849763452252, 837.2464781696491, 837.4807619276027, 798.5687728626564, 824.3158178711685, 824.4270232188632, 826.3141592478229, 828.0601517277903, 870.503812826689, 870.6212797433105, 870.8127752533204, 874.3049275825703, 876.3952872517974, 863.5897948474455, 864.4597126795753, 872.8167084912176, 873.9563021848913, 874.4971641306274, 625.6840295650667, 629.8614304852925, 631.2582715309538, 631.4916492223758, 636.7834936121694, 14513.854861451462, 14515.274236288249, 14532.128072315694, 14535.90980676443, 14545.054571452822, 12871.549495767604, 12876.484940602364, 12952.417141228667, 12993.0, 13415.128016678884, 10682.359058456439, 10730.409827459487, 11081.390523521202, 11238.100951923827, 11391.430428478625, 3641.1625326174862, 3735.364987952055, 3760.9623903760885, 3763.9623603764157, 3921.450996860442, 81366.18633813705, 83299.5835020827, 83379.0, 83450.0, 83852.99999999939, 10254.58981640726, 10271.0, 10322.967703229617, 10342.431166285776, 10406.687799366031, 20502.487437814176, 20659.17363305451, 20692.275770348268, 20760.896195518926, 20839.8958005209, 7408.481406301507, 8306.210909963665, 8308.70919517814, 8400.747977560683, 8496.277816385553, 4595.813300683845, 4633.8841528961375, 4724.267738500538, 4757.976210118927, 4897.7795999180125, 3296.3736889991305, 3299.5215693724754, 3347.7489188310974, 3351.8324083795715, 3420.2304481491965, 571.6998575747682, 575.1401654526426, 577.5697105656313, 595.3510673366052, 602.3374288282942, 616.3713012727083, 627.7740013595102, 661.8312330355728, 687.8727435424463, 712.1916624631081, 9151.63393464254, 10071.395716257048, 10151.168661459516, 10414.854366019732, 10760.246782725135, 585.9062549992066, 634.4702173685025, 662.9734810607522, 742.9702811887464, 745.2584678245072, 4862.896102736171, 5047.924281135786, 5070.467600901926, 5086.0, 5094.319833385748, 113879.0, 117091.41454292844, 117698.0, 118775.0, 119004.0, 88638.0, 90285.0, 102421.48789256155, 103230.48384758028, 104100.0, 57879.42120578909, 83762.0, 89721.65417518742, 90955.54522227478, 91441.0, 10188.949055254676, 10230.181585473294, 10250.794984100126, 10328.793424131325, 10334.173266138841, 38181.23637527289, 39229.0, 51771.482285176666, 52131.21803172879, 52758.0, 54331.0, 74044.62977685076, 74848.25151748412, 74920.62539687267, 75241.62379188069, 11945.0, 12653.042874483524, 12776.680582985127, 12827.486900523874, 13332.466701331838, 13554.457821687416, 13583.660408489866, 13859.722805543632, 13870.167789932637, 14455.566333010027, 13133.802992954923, 13280.867191327963, 13621.863781362455, 14129.222892740587, 14499.637509062359, 12257.325847078497, 13114.409851556893, 13742.381592828548, 14415.855841441451, 14442.0, 12081.818772718592, 12755.681107972376, 12890.613281601567, 13006.674833129247, 13117.34413279313, 11263.605773797877, 11547.364894930859, 11574.305541667527, 11944.462499187384, 12105.0, 11028.699458004043, 11042.503087361249, 11330.0, 11351.37567433799, 11531.8270225945], "value": 7438.704399621269, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1541.7, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 106.0, 112.0, 111.0, 110.0, 112.0, 111.0, 110.0, 110.0, 111.0], "value": 110.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 133.0, 154.0, 191.0, 127.0, 164.0, 161.0, 129.0, 185.0, 126.0], "value": 153.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 163.0, 161.0, 166.0, 170.0, 168.0, 162.0, 162.0, 163.0, 161.0], "value": 164.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 75.0, 76.0, 172.0, 76.0, 74.0, 75.0, 76.0, 160.0, 75.0], "value": 93.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 86.0, 156.0, 84.0, 84.0, 85.0, 144.0, 84.0, 86.0, 145.0], "value": 104.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 119.0, 117.0, 117.0, 118.0, 117.0, 118.0, 117.0, 118.0, 118.0], "value": 117.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 150.0, 148.0, 147.0, 148.0, 147.0, 148.0, 146.0, 147.0], "value": 147.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 96.0, 96.0, 95.0, 95.0, 96.0, 96.0, 95.0, 95.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 56.0, 54.0, 54.0, 56.0, 58.0, 53.0, 55.0, 54.0, 57.0], "value": 55.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 62.0, 62.0, 62.0, 63.0, 68.0, 62.0, 62.0, 61.0, 62.0], "value": 62.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 81.0, 85.0, 87.0, 82.0, 86.0, 81.0, 81.0, 113.0, 80.0], "value": 85.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [125.0, 145.0, 123.0, 126.0, 127.0, 125.0, 122.0, 123.0, 138.0, 124.0], "value": 127.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 164.0, 158.0, 160.0, 163.0, 160.0, 166.0, 159.0, 156.0, 158.0], "value": 160.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 65.0, 63.0, 64.0, 64.0, 63.0, 63.0, 63.0, 63.0, 64.0], "value": 63.5, "unit": "score"}]}]} 20:44:39 INFO - Return code: 0 20:44:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 20:44:39 ERROR - # TBPL SUCCESS # 20:44:39 INFO - Running post-action listener: _resource_record_post_action 20:44:39 INFO - ##### 20:44:39 INFO - ##### Finished run-tests step (success) 20:44:39 INFO - ##### 20:44:39 INFO - Running post-run listener: _resource_record_post_run 20:44:39 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 0; Write bytes: 547942400; Read time: 0; Write time: 498376 20:44:39 INFO - TinderboxPrint: CPU usage
13.5% 20:44:39 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 20:44:39 INFO - TinderboxPrint: I/O write bytes / time
547,942,400 / 498,376 20:44:39 INFO - TinderboxPrint: CPU idle
8,226.7 (86.5%) 20:44:39 INFO - TinderboxPrint: CPU user
1,222.9 (12.9%) 20:44:39 INFO - TinderboxPrint: Swap in / out
0 / 0 20:44:39 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 255778816; Read time: 0; Write time: 315628 20:44:39 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 292163584; Read time: 0; Write time: 182748 20:44:40 INFO - Running post-run listener: _upload_blobber_files 20:44:40 INFO - Blob upload gear active. 20:44:40 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 20:44:40 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 20:44:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 20:44:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 20:44:40 INFO - (blobuploader) - INFO - Open directory for files ... 20:44:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 20:44:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:44:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:44:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 20:44:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:44:44 INFO - (blobuploader) - INFO - Done attempting. 20:44:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 20:44:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:44:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:44:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 20:44:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:44:45 INFO - (blobuploader) - INFO - Done attempting. 20:44:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 20:44:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:44:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:44:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 20:44:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:44:46 INFO - (blobuploader) - INFO - Done attempting. 20:44:46 INFO - (blobuploader) - INFO - Iteration through files over. 20:44:46 INFO - Return code: 0 20:44:46 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 20:44:46 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 20:44:46 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc01f6a327087a7eb6b4d0e27976e14fc01cc2f7fa0d6f3db63c1dc7e9c73884b82cd6c79edea031da42dcc5c988278ddc3c06574a29042c6a08bd13e35b1655", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a5f54ac60916cbebe557492979525be84da0575864c91ff352f2eb5b9e2aefa66f0dce2ddeffbc9882180168389dd426744aca70f37682b0ccb80e2628e89c96", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/38fd325a33378b413966ef1a0cc983ac9e6131e1e1469ebdca27ee36bb9f053b998da6d262fcaff3a07ca60b1bd88d013db2a9744822885614dc2c9c1e503d1a"} 20:44:46 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 20:44:46 INFO - Writing to file /builds/slave/test/properties/blobber_files 20:44:46 INFO - Contents: 20:44:46 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc01f6a327087a7eb6b4d0e27976e14fc01cc2f7fa0d6f3db63c1dc7e9c73884b82cd6c79edea031da42dcc5c988278ddc3c06574a29042c6a08bd13e35b1655", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a5f54ac60916cbebe557492979525be84da0575864c91ff352f2eb5b9e2aefa66f0dce2ddeffbc9882180168389dd426744aca70f37682b0ccb80e2628e89c96", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/38fd325a33378b413966ef1a0cc983ac9e6131e1e1469ebdca27ee36bb9f053b998da6d262fcaff3a07ca60b1bd88d013db2a9744822885614dc2c9c1e503d1a"} 20:44:46 INFO - Running post-run listener: copy_logs_to_upload_dir 20:44:46 INFO - Copying logs to upload dir... 20:44:46 INFO - mkdir: /builds/slave/test/build/upload/logs 20:44:46 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.774350 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-06-14 20:44:44.740281) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-14 20:44:44.743744) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/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/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc01f6a327087a7eb6b4d0e27976e14fc01cc2f7fa0d6f3db63c1dc7e9c73884b82cd6c79edea031da42dcc5c988278ddc3c06574a29042c6a08bd13e35b1655", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a5f54ac60916cbebe557492979525be84da0575864c91ff352f2eb5b9e2aefa66f0dce2ddeffbc9882180168389dd426744aca70f37682b0ccb80e2628e89c96", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/38fd325a33378b413966ef1a0cc983ac9e6131e1e1469ebdca27ee36bb9f053b998da6d262fcaff3a07ca60b1bd88d013db2a9744822885614dc2c9c1e503d1a"} build_url:https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011338 build_url: 'https://queue.taskcluster.net/v1/task/RXlXUSD5Q52nbOSLFKj_MQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fc01f6a327087a7eb6b4d0e27976e14fc01cc2f7fa0d6f3db63c1dc7e9c73884b82cd6c79edea031da42dcc5c988278ddc3c06574a29042c6a08bd13e35b1655", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a5f54ac60916cbebe557492979525be84da0575864c91ff352f2eb5b9e2aefa66f0dce2ddeffbc9882180168389dd426744aca70f37682b0ccb80e2628e89c96", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/38fd325a33378b413966ef1a0cc983ac9e6131e1e1469ebdca27ee36bb9f053b998da6d262fcaff3a07ca60b1bd88d013db2a9744822885614dc2c9c1e503d1a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-14 20:44:44.769038) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:44:44.769392) ========= rm -f oauth.txt in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=cbe409c6de289db6ac707de3000001d4-1465959255.348859-1690513551 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004481 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:44:44.853684) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-14 20:44:44.854030) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-14 20:44:44.854359) ========= ========= Total master_lag: 0.21 =========