builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-028 starttime: 1466071412.18 results: success (0) buildid: 20160616024225 builduid: 4b12924f20924a8d83c264091fb33be9 revision: ccae8d5e75869480d64882bc6f797e3433a8d00c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.183751) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.184118) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.184383) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.227413) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.227737) ========= 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=836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-16 03:03:33-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 222M=0s 2016-06-16 03:03:33 (222 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.084425 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.325861) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.326198) ========= 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=836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023196 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.374899) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:32.375205) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev ccae8d5e75869480d64882bc6f797e3433a8d00c --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 ccae8d5e75869480d64882bc6f797e3433a8d00c --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=836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-16 03:03:33,371 truncating revision to first 12 chars 2016-06-16 03:03:33,371 Setting DEBUG logging. 2016-06-16 03:03:33,371 attempt 1/10 2016-06-16 03:03:33,371 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ccae8d5e7586?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-16 03:03:33,691 unpacking tar archive at: fx-team-ccae8d5e7586/testing/mozharness/ program finished with exit code 0 elapsedTime=0.657410 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:33.050352) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:33.050631) ========= script_repo_revision: ccae8d5e75869480d64882bc6f797e3433a8d00c ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:33.050978) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:33.051235) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-16 03:03:33.075806) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 56 secs) (at 2016-06-16 03:03:33.076052) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 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-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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=836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:03:34 INFO - MultiFileLogger online at 20160616 03:03:34 in /builds/slave/test 03:03:34 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 03:03:34 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:03:34 INFO - {'append_to_log': False, 03:03:34 INFO - 'base_work_dir': '/builds/slave/test', 03:03:34 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 03:03:34 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:03:34 INFO - 'branch': 'Fx-Team-Non-PGO', 03:03:34 INFO - 'buildbot_json_path': 'buildprops.json', 03:03:34 INFO - 'config_files': ('talos/linux_config.py',), 03:03:34 INFO - 'default_actions': ('clobber', 03:03:34 INFO - 'read-buildbot-config', 03:03:34 INFO - 'download-and-extract', 03:03:34 INFO - 'populate-webroot', 03:03:34 INFO - 'create-virtualenv', 03:03:34 INFO - 'install', 03:03:34 INFO - 'run-tests'), 03:03:34 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:03:34 INFO - 'download_minidump_stackwalk': True, 03:03:34 INFO - 'download_symbols': 'ondemand', 03:03:34 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:03:34 INFO - 'tooltool.py': '/tools/tooltool.py', 03:03:34 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:03:34 INFO - '/tools/misc-python/virtualenv.py')}, 03:03:34 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:03:34 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:03:34 INFO - 'installer_path': 'installer.exe', 03:03:34 INFO - 'log_level': 'info', 03:03:34 INFO - 'log_name': 'talos', 03:03:34 INFO - 'log_to_console': True, 03:03:34 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:03:34 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:03:34 INFO - 'opt_config_files': (), 03:03:34 INFO - 'pip_index': False, 03:03:34 INFO - 'sps_profile': False, 03:03:34 INFO - 'sps_profile_interval': 0, 03:03:34 INFO - 'suite': 'dromaeojs-e10s', 03:03:34 INFO - 'system_bits': '32', 03:03:34 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:03:34 INFO - 'title': 'talos-linux64-ix-028', 03:03:34 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:03:34 INFO - 'use_talos_json': True, 03:03:34 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:03:34 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:03:34 INFO - 'work_dir': 'build'} 03:03:34 INFO - ##### 03:03:34 INFO - ##### Running clobber step. 03:03:34 INFO - ##### 03:03:34 INFO - Running pre-action listener: _resource_record_pre_action 03:03:34 INFO - Running main action method: clobber 03:03:34 INFO - rmtree: /builds/slave/test/build 03:03:34 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:03:34 INFO - Running post-action listener: _resource_record_post_action 03:03:34 INFO - ##### 03:03:34 INFO - ##### Finished clobber step (success) 03:03:34 INFO - ##### 03:03:34 INFO - ##### 03:03:34 INFO - ##### Running read-buildbot-config step. 03:03:34 INFO - ##### 03:03:34 INFO - Running pre-action listener: _resource_record_pre_action 03:03:34 INFO - Running main action method: read_buildbot_config 03:03:34 INFO - Using buildbot properties: 03:03:34 INFO - { 03:03:34 INFO - "project": "", 03:03:34 INFO - "product": "firefox", 03:03:34 INFO - "script_repo_revision": "production", 03:03:34 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 03:03:34 INFO - "repository": "", 03:03:34 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 03:03:34 INFO - "buildid": "20160616024225", 03:03:34 INFO - "pgo_build": "False", 03:03:34 INFO - "basedir": "/builds/slave/test", 03:03:34 INFO - "buildnumber": 1590, 03:03:34 INFO - "slavename": "talos-linux64-ix-028", 03:03:34 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 03:03:34 INFO - "platform": "ubuntu64_hw", 03:03:34 INFO - "scheduler": "tests-fx-team-linux64-talos", 03:03:34 INFO - "branch": "fx-team", 03:03:34 INFO - "repo_path": "integration/fx-team", 03:03:34 INFO - "revision": "ccae8d5e75869480d64882bc6f797e3433a8d00c", 03:03:34 INFO - "stage_platform": "linux64", 03:03:34 INFO - "builduid": "4b12924f20924a8d83c264091fb33be9", 03:03:34 INFO - "slavebuilddir": "test" 03:03:34 INFO - } 03:03:34 INFO - Found installer url https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 03:03:34 INFO - Running post-action listener: _resource_record_post_action 03:03:34 INFO - ##### 03:03:34 INFO - ##### Finished read-buildbot-config step (success) 03:03:34 INFO - ##### 03:03:34 INFO - ##### 03:03:34 INFO - ##### Running download-and-extract step. 03:03:34 INFO - ##### 03:03:34 INFO - Running pre-action listener: _resource_record_pre_action 03:03:34 INFO - Running main action method: download_and_extract 03:03:34 INFO - mkdir: /builds/slave/test/build/tests 03:03:34 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')]} 03:03:34 INFO - https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 03:03:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:03:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:03:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:38 INFO - Downloaded 1361 bytes. 03:03:38 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:03:38 INFO - Using the following test package requirements: 03:03:38 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 03:03:38 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:03:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 03:03:38 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:03:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 03:03:38 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:03:38 INFO - u'jsshell-linux-x86_64.zip'], 03:03:38 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:03:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 03:03:38 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 03:03:38 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:03:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 03:03:38 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:03:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 03:03:38 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:03:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 03:03:38 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:03:38 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 03:03:38 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:03:38 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')]} 03:03:38 INFO - https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:03:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:03:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:03:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:44 INFO - Downloaded 22654791 bytes. 03:03:44 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'] 03:03:44 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 03:03:45 INFO - Return code: 0 03:03:45 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 03:03:45 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')]} 03:03:45 INFO - https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:03:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:03:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:03:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:53 INFO - Downloaded 22654791 bytes. 03:03:53 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'] 03:03:53 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 03:03:54 INFO - Return code: 0 03:03:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:03:54 INFO - https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:03:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 03:03:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 03:03:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:55 INFO - Downloaded 14405384 bytes. 03:03:55 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'] 03:03:55 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 03:03:56 INFO - Return code: 0 03:03:56 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')]} 03:03:56 INFO - https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:03:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:03:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:03:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JaqKuowaSxagxjXatsmacA/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 03:03:58 INFO - Downloaded 55443158 bytes. 03:03:58 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:03:58 INFO - mkdir: /builds/slave/test/properties 03:03:58 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:03:58 INFO - Writing to file /builds/slave/test/properties/build_url 03:03:58 INFO - Contents: 03:03:58 INFO - build_url:https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:03:59 INFO - Running post-action listener: _resource_record_post_action 03:03:59 INFO - Running post-action listener: set_extra_try_arguments 03:03:59 INFO - ##### 03:03:59 INFO - ##### Finished download-and-extract step (success) 03:03:59 INFO - ##### 03:03:59 INFO - ##### 03:03:59 INFO - ##### Running populate-webroot step. 03:03:59 INFO - ##### 03:03:59 INFO - Running pre-action listener: _resource_record_pre_action 03:03:59 INFO - Running main action method: populate_webroot 03:03:59 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:03:59 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:03:59 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:03:59 INFO - '--tppagecycles', 03:03:59 INFO - '7'], 03:03:59 INFO - 'tests': ['tsvgm']}}, 03:03:59 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:03:59 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:03:59 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:03:59 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:03:59 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:03:59 INFO - 'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:03:59 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:03:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:03:59 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:03:59 INFO - 'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['damp', 'tps']}, 03:03:59 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:03:59 INFO - 'tests': ['damp', 'tps']}, 03:03:59 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['dromaeo_dom']}, 03:03:59 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:03:59 INFO - 'g4': {'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['basic_compositor_video']}, 03:03:59 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 03:03:59 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['a11yr', 03:03:59 INFO - 'ts_paint', 03:03:59 INFO - 'tpaint', 03:03:59 INFO - 'sessionrestore', 03:03:59 INFO - 'sessionrestore_no_auto_restore', 03:03:59 INFO - 'tabpaint']}, 03:03:59 INFO - 'other-e10s': {'tests': ['a11yr', 03:03:59 INFO - 'ts_paint', 03:03:59 INFO - 'tpaint', 03:03:59 INFO - 'sessionrestore', 03:03:59 INFO - 'sessionrestore_no_auto_restore', 03:03:59 INFO - 'tabpaint']}, 03:03:59 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:03:59 INFO - 'ts_paint', 03:03:59 INFO - 'tpaint', 03:03:59 INFO - 'sessionrestore', 03:03:59 INFO - 'sessionrestore_no_auto_restore', 03:03:59 INFO - 'tabpaint']}, 03:03:59 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:03:59 INFO - 'ts_paint', 03:03:59 INFO - 'tpaint', 03:03:59 INFO - 'sessionrestore', 03:03:59 INFO - 'sessionrestore_no_auto_restore', 03:03:59 INFO - 'tabpaint']}, 03:03:59 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['a11yr', 03:03:59 INFO - 'ts_paint', 03:03:59 INFO - 'tpaint', 03:03:59 INFO - 'sessionrestore', 03:03:59 INFO - 'sessionrestore_no_auto_restore', 03:03:59 INFO - 'tabpaint']}, 03:03:59 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['a11yr', 03:03:59 INFO - 'ts_paint', 03:03:59 INFO - 'tpaint', 03:03:59 INFO - 'sessionrestore', 03:03:59 INFO - 'sessionrestore_no_auto_restore', 03:03:59 INFO - 'tabpaint']}, 03:03:59 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['tsvgx', 03:03:59 INFO - 'tsvgr_opacity', 03:03:59 INFO - 'tart', 03:03:59 INFO - 'tscrollx', 03:03:59 INFO - 'cart']}, 03:03:59 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:03:59 INFO - 'tsvgr_opacity', 03:03:59 INFO - 'tart', 03:03:59 INFO - 'tscrollx', 03:03:59 INFO - 'cart']}, 03:03:59 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:03:59 INFO - 'talos_options': ['--disable-e10s'], 03:03:59 INFO - 'tests': ['tp5o']}, 03:03:59 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:03:59 INFO - 'tests': ['tp5o']}, 03:03:59 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:03:59 INFO - 'talos_options': ['--disable-e10s', 03:03:59 INFO - '--xperf_path', 03:03:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:03:59 INFO - 'tests': ['tp5n']}, 03:03:59 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:03:59 INFO - 'talos_options': ['--xperf_path', 03:03:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:03:59 INFO - 'tests': ['tp5n']}}, 03:03:59 INFO - 'talos.zip': {'path': '', 03:03:59 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:03:59 INFO - Running post-action listener: _resource_record_post_action 03:03:59 INFO - ##### 03:03:59 INFO - ##### Finished populate-webroot step (success) 03:03:59 INFO - ##### 03:03:59 INFO - ##### 03:03:59 INFO - ##### Running create-virtualenv step. 03:03:59 INFO - ##### 03:03:59 INFO - Running pre-action listener: _resource_record_pre_action 03:03:59 INFO - Running main action method: create_virtualenv 03:03:59 INFO - Creating virtualenv /builds/slave/test/build/venv 03:03:59 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 03:03:59 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:03:59 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:03:59 INFO - Using real prefix '/usr' 03:03:59 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:03:59 INFO - Installing distribute.............................................................................................................................................................................................done. 03:04:01 INFO - Installing pip.................done. 03:04:01 INFO - Return code: 0 03:04:01 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:04:01 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')]} 03:04:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:01 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')]} 03:04:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:01 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:01 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 03:04:01 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 03:04:01 INFO - Using env: {'DISPLAY': ':0', 03:04:01 INFO - 'HOME': '/home/cltbld', 03:04:01 INFO - 'LANG': 'en_US.UTF-8', 03:04:01 INFO - 'LANGUAGE': 'en_US:en', 03:04:01 INFO - 'LOGNAME': 'cltbld', 03:04:01 INFO - 'MAIL': '/var/mail/cltbld', 03:04:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:01 INFO - 'MOZ_NO_REMOTE': '1', 03:04:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:01 INFO - 'NO_EM_RESTART': '1', 03:04:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:01 INFO - 'PWD': '/builds/slave/test', 03:04:01 INFO - 'SHELL': '/bin/bash', 03:04:01 INFO - 'SHLVL': '1', 03:04:01 INFO - 'TERM': 'linux', 03:04:01 INFO - 'TMOUT': '86400', 03:04:01 INFO - 'USER': 'cltbld', 03:04:01 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:01 INFO - '_': '/tools/buildbot/bin/python'} 03:04:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:02 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 03:04:02 INFO - Cleaning up... 03:04:02 INFO - Return code: 0 03:04:02 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:04:02 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')]} 03:04:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:02 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')]} 03:04:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:02 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:02 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 03:04:02 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 03:04:02 INFO - Using env: {'DISPLAY': ':0', 03:04:02 INFO - 'HOME': '/home/cltbld', 03:04:02 INFO - 'LANG': 'en_US.UTF-8', 03:04:02 INFO - 'LANGUAGE': 'en_US:en', 03:04:02 INFO - 'LOGNAME': 'cltbld', 03:04:02 INFO - 'MAIL': '/var/mail/cltbld', 03:04:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:02 INFO - 'MOZ_NO_REMOTE': '1', 03:04:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:02 INFO - 'NO_EM_RESTART': '1', 03:04:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:02 INFO - 'PWD': '/builds/slave/test', 03:04:02 INFO - 'SHELL': '/bin/bash', 03:04:02 INFO - 'SHLVL': '1', 03:04:02 INFO - 'TERM': 'linux', 03:04:02 INFO - 'TMOUT': '86400', 03:04:02 INFO - 'USER': 'cltbld', 03:04:02 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:02 INFO - '_': '/tools/buildbot/bin/python'} 03:04:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:02 INFO - Downloading/unpacking psutil>=3.1.1 03:04:02 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 03:04:02 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 03:04:02 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 03:04:02 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 03:04:02 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 03:04:02 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 03:04:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:04:04 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:04:04 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:04:04 INFO - Installing collected packages: psutil 03:04:04 INFO - Running setup.py install for psutil 03:04:04 INFO - building 'psutil._psutil_linux' extension 03:04:04 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 03:04:04 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 03:04:04 INFO - building 'psutil._psutil_posix' extension 03:04:04 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 03:04:04 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 03:04:04 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:04:04 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:04:04 INFO - Successfully installed psutil 03:04:04 INFO - Cleaning up... 03:04:04 INFO - Return code: 0 03:04:04 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:04: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')]} 03:04:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04: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')]} 03:04:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:04 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:04 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 03:04:04 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 03:04:04 INFO - Using env: {'DISPLAY': ':0', 03:04:04 INFO - 'HOME': '/home/cltbld', 03:04:04 INFO - 'LANG': 'en_US.UTF-8', 03:04:04 INFO - 'LANGUAGE': 'en_US:en', 03:04:04 INFO - 'LOGNAME': 'cltbld', 03:04:04 INFO - 'MAIL': '/var/mail/cltbld', 03:04:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:04 INFO - 'MOZ_NO_REMOTE': '1', 03:04:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:04 INFO - 'NO_EM_RESTART': '1', 03:04:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:04 INFO - 'PWD': '/builds/slave/test', 03:04:04 INFO - 'SHELL': '/bin/bash', 03:04:04 INFO - 'SHLVL': '1', 03:04:04 INFO - 'TERM': 'linux', 03:04:04 INFO - 'TMOUT': '86400', 03:04:04 INFO - 'USER': 'cltbld', 03:04:04 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:04 INFO - '_': '/tools/buildbot/bin/python'} 03:04:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:05 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:04:05 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 03:04:05 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 03:04:05 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 03:04:05 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 03:04:05 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 03:04:05 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 03:04:07 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:04:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:04:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:04:07 INFO - Installing collected packages: mozsystemmonitor 03:04:07 INFO - Running setup.py install for mozsystemmonitor 03:04:07 INFO - Successfully installed mozsystemmonitor 03:04:07 INFO - Cleaning up... 03:04:07 INFO - Return code: 0 03:04:07 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:04:07 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')]} 03:04:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:07 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')]} 03:04:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:07 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:07 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 03:04:07 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 03:04:07 INFO - Using env: {'DISPLAY': ':0', 03:04:07 INFO - 'HOME': '/home/cltbld', 03:04:07 INFO - 'LANG': 'en_US.UTF-8', 03:04:07 INFO - 'LANGUAGE': 'en_US:en', 03:04:07 INFO - 'LOGNAME': 'cltbld', 03:04:07 INFO - 'MAIL': '/var/mail/cltbld', 03:04:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:07 INFO - 'MOZ_NO_REMOTE': '1', 03:04:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:07 INFO - 'NO_EM_RESTART': '1', 03:04:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:07 INFO - 'PWD': '/builds/slave/test', 03:04:07 INFO - 'SHELL': '/bin/bash', 03:04:07 INFO - 'SHLVL': '1', 03:04:07 INFO - 'TERM': 'linux', 03:04:07 INFO - 'TMOUT': '86400', 03:04:07 INFO - 'USER': 'cltbld', 03:04:07 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:07 INFO - '_': '/tools/buildbot/bin/python'} 03:04:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:07 INFO - Downloading/unpacking jsonschema==2.5.1 03:04:07 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 03:04:07 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 03:04:07 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 03:04:07 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 03:04:07 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 03:04:07 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 03:04:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:04:09 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:04:09 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 03:04:09 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 03:04:09 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 03:04:09 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 03:04:09 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 03:04:09 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 03:04:09 INFO - Downloading functools32-3.2.3-2.tar.gz 03:04:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:04:09 INFO - warning: no files found matching '*.txt' 03:04:09 INFO - no previously-included directories found matching 'build' 03:04:09 INFO - no previously-included directories found matching 'dist' 03:04:09 INFO - no previously-included directories found matching '.git*' 03:04:09 INFO - Installing collected packages: jsonschema, functools32 03:04:09 INFO - Running setup.py install for functools32 03:04:09 INFO - warning: no files found matching '*.txt' 03:04:09 INFO - no previously-included directories found matching 'build' 03:04:09 INFO - no previously-included directories found matching 'dist' 03:04:09 INFO - no previously-included directories found matching '.git*' 03:04:09 INFO - Successfully installed jsonschema functools32 03:04:09 INFO - Cleaning up... 03:04:09 INFO - Return code: 0 03:04:09 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:04:09 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')]} 03:04:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:09 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')]} 03:04:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:09 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:09 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 03:04:09 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 03:04:09 INFO - Using env: {'DISPLAY': ':0', 03:04:09 INFO - 'HOME': '/home/cltbld', 03:04:09 INFO - 'LANG': 'en_US.UTF-8', 03:04:09 INFO - 'LANGUAGE': 'en_US:en', 03:04:09 INFO - 'LOGNAME': 'cltbld', 03:04:09 INFO - 'MAIL': '/var/mail/cltbld', 03:04:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:09 INFO - 'MOZ_NO_REMOTE': '1', 03:04:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:09 INFO - 'NO_EM_RESTART': '1', 03:04:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:09 INFO - 'PWD': '/builds/slave/test', 03:04:09 INFO - 'SHELL': '/bin/bash', 03:04:09 INFO - 'SHLVL': '1', 03:04:09 INFO - 'TERM': 'linux', 03:04:09 INFO - 'TMOUT': '86400', 03:04:09 INFO - 'USER': 'cltbld', 03:04:09 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:09 INFO - '_': '/tools/buildbot/bin/python'} 03:04:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:09 INFO - Downloading/unpacking blobuploader==1.2.4 03:04:09 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 03:04:09 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 03:04:09 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 03:04:09 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 03:04:09 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 03:04:09 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 03:04:11 INFO - Downloading blobuploader-1.2.4.tar.gz 03:04:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:04:11 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:04:11 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 03:04:11 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 03:04:11 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 03:04:11 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 03:04:11 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 03:04:11 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 03:04:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:04:12 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:04:12 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 03:04:12 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 03:04:12 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 03:04:12 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 03:04:12 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 03:04:12 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 03:04:12 INFO - Downloading docopt-0.6.1.tar.gz 03:04:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:04:12 INFO - Installing collected packages: blobuploader, requests, docopt 03:04:12 INFO - Running setup.py install for blobuploader 03:04:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:04:12 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:04:12 INFO - Running setup.py install for requests 03:04:13 INFO - Running setup.py install for docopt 03:04:13 INFO - Successfully installed blobuploader requests docopt 03:04:13 INFO - Cleaning up... 03:04:13 INFO - Return code: 0 03:04:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:04: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')]} 03:04:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04: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')]} 03:04:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:13 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:13 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 03:04:13 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 03:04:13 INFO - Using env: {'DISPLAY': ':0', 03:04:13 INFO - 'HOME': '/home/cltbld', 03:04:13 INFO - 'LANG': 'en_US.UTF-8', 03:04:13 INFO - 'LANGUAGE': 'en_US:en', 03:04:13 INFO - 'LOGNAME': 'cltbld', 03:04:13 INFO - 'MAIL': '/var/mail/cltbld', 03:04:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:13 INFO - 'MOZ_NO_REMOTE': '1', 03:04:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:13 INFO - 'NO_EM_RESTART': '1', 03:04:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:13 INFO - 'PWD': '/builds/slave/test', 03:04:13 INFO - 'SHELL': '/bin/bash', 03:04:13 INFO - 'SHLVL': '1', 03:04:13 INFO - 'TERM': 'linux', 03:04:13 INFO - 'TMOUT': '86400', 03:04:13 INFO - 'USER': 'cltbld', 03:04:13 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:13 INFO - '_': '/tools/buildbot/bin/python'} 03:04:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:04:13 INFO - Running setup.py (path:/tmp/pip-ruvTp4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:04:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:04:13 INFO - Running setup.py (path:/tmp/pip-XQTMAb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:04:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:04:13 INFO - Running setup.py (path:/tmp/pip-fjwQBo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:04:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:04:13 INFO - Running setup.py (path:/tmp/pip-JRlIP6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:04:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:04:13 INFO - Running setup.py (path:/tmp/pip-oyy02F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:04:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:04:13 INFO - Running setup.py (path:/tmp/pip-EOHkcn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:04:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:04:13 INFO - Running setup.py (path:/tmp/pip-8eoKeM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:04:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:04:13 INFO - Running setup.py (path:/tmp/pip-5nRchP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:04:14 INFO - Running setup.py (path:/tmp/pip-MwQKVZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:04:14 INFO - Running setup.py (path:/tmp/pip-UuWvj1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:04:14 INFO - Running setup.py (path:/tmp/pip-Yx4ls5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:04:14 INFO - Running setup.py (path:/tmp/pip-dsTFPz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:04:14 INFO - Running setup.py (path:/tmp/pip-25IJxJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:04:14 INFO - Running setup.py (path:/tmp/pip-E_PUyP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:04:14 INFO - Running setup.py (path:/tmp/pip-h6YpmR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:04:14 INFO - Running setup.py (path:/tmp/pip-_h8yj3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:04:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:04:14 INFO - Running setup.py (path:/tmp/pip-NFd35i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:04:14 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:04:14 INFO - Running setup.py install for manifestparser 03:04:14 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:04:14 INFO - Running setup.py install for mozcrash 03:04:14 INFO - Running setup.py install for mozdebug 03:04:14 INFO - Running setup.py install for mozdevice 03:04:15 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Running setup.py install for mozfile 03:04:15 INFO - Running setup.py install for mozhttpd 03:04:15 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Running setup.py install for mozinfo 03:04:15 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Running setup.py install for mozInstall 03:04:15 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Running setup.py install for mozleak 03:04:15 INFO - Running setup.py install for mozlog 03:04:15 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Running setup.py install for moznetwork 03:04:15 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:04:15 INFO - Running setup.py install for mozprocess 03:04:15 INFO - Running setup.py install for mozprofile 03:04:16 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:04:16 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:04:16 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:04:16 INFO - Running setup.py install for mozrunner 03:04:16 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:04:16 INFO - Running setup.py install for mozscreenshot 03:04:16 INFO - Running setup.py install for moztest 03:04:16 INFO - Running setup.py install for mozversion 03:04:16 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:04:16 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:04:16 INFO - Cleaning up... 03:04:16 INFO - Return code: 0 03:04:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:04:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:04:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:04:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:16 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:16 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 03:04:16 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 03:04:16 INFO - Using env: {'DISPLAY': ':0', 03:04:16 INFO - 'HOME': '/home/cltbld', 03:04:16 INFO - 'LANG': 'en_US.UTF-8', 03:04:16 INFO - 'LANGUAGE': 'en_US:en', 03:04:16 INFO - 'LOGNAME': 'cltbld', 03:04:16 INFO - 'MAIL': '/var/mail/cltbld', 03:04:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:16 INFO - 'MOZ_NO_REMOTE': '1', 03:04:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:16 INFO - 'NO_EM_RESTART': '1', 03:04:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:16 INFO - 'PWD': '/builds/slave/test', 03:04:16 INFO - 'SHELL': '/bin/bash', 03:04:16 INFO - 'SHLVL': '1', 03:04:16 INFO - 'TERM': 'linux', 03:04:16 INFO - 'TMOUT': '86400', 03:04:16 INFO - 'USER': 'cltbld', 03:04:16 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:16 INFO - '_': '/tools/buildbot/bin/python'} 03:04:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:04:16 INFO - Running setup.py (path:/tmp/pip-NQGpAX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:04:16 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)) 03:04:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:04:16 INFO - Running setup.py (path:/tmp/pip-iifcdk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:04:16 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)) 03:04:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:04:16 INFO - Running setup.py (path:/tmp/pip-oQqnV8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:04:16 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)) 03:04:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:04:16 INFO - Running setup.py (path:/tmp/pip-TFtEMp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:04:17 INFO - Running setup.py (path:/tmp/pip-0NcJMX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:04:17 INFO - Running setup.py (path:/tmp/pip-cEz52X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:04:17 INFO - Running setup.py (path:/tmp/pip-wiUhmc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:04:17 INFO - Running setup.py (path:/tmp/pip-4_awle-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:04:17 INFO - Running setup.py (path:/tmp/pip-R3w7L3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:04:17 INFO - Running setup.py (path:/tmp/pip-nXk6Kv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:04:17 INFO - Running setup.py (path:/tmp/pip-yyNsMn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:04:17 INFO - Running setup.py (path:/tmp/pip-2iqxdL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:04:17 INFO - Running setup.py (path:/tmp/pip-CWHjxr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:04:17 INFO - Running setup.py (path:/tmp/pip-eUwDLX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:04:17 INFO - Running setup.py (path:/tmp/pip-ENDg7X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:04:17 INFO - Running setup.py (path:/tmp/pip-jQQ9ng-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:04:17 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)) 03:04:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:04:17 INFO - Running setup.py (path:/tmp/pip-Hid4dF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:04:17 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)) 03:04:17 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)) 03:04:17 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)) 03:04:17 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)) 03:04:17 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)) 03:04:17 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)) 03:04:17 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:04:17 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 03:04:17 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 03:04:17 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 03:04:17 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 03:04:17 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 03:04:17 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 03:04:19 INFO - Downloading blessings-1.6.tar.gz 03:04:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:04:19 INFO - Installing collected packages: blessings 03:04:19 INFO - Running setup.py install for blessings 03:04:20 INFO - Successfully installed blessings 03:04:20 INFO - Cleaning up... 03:04:20 INFO - Return code: 0 03:04:20 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:04:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:04:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:04:20 INFO - Reading from file tmpfile_stdout 03:04:20 INFO - Current package versions: 03:04:20 INFO - argparse == 1.2.1 03:04:20 INFO - blessings == 1.6 03:04:20 INFO - blobuploader == 1.2.4 03:04:20 INFO - docopt == 0.6.1 03:04:20 INFO - functools32 == 3.2.3-2 03:04:20 INFO - jsonschema == 2.5.1 03:04:20 INFO - manifestparser == 1.1 03:04:20 INFO - mozInstall == 1.12 03:04:20 INFO - mozcrash == 0.17 03:04:20 INFO - mozdebug == 0.1 03:04:20 INFO - mozdevice == 0.48 03:04:20 INFO - mozfile == 1.2 03:04:20 INFO - mozhttpd == 0.7 03:04:20 INFO - mozinfo == 0.9 03:04:20 INFO - mozleak == 0.1 03:04:20 INFO - mozlog == 3.2 03:04:20 INFO - moznetwork == 0.27 03:04:20 INFO - mozprocess == 0.22 03:04:20 INFO - mozprofile == 0.28 03:04:20 INFO - mozrunner == 6.11 03:04:20 INFO - mozscreenshot == 0.1 03:04:20 INFO - mozsystemmonitor == 0.3 03:04:20 INFO - moztest == 0.7 03:04:20 INFO - mozversion == 1.4 03:04:20 INFO - psutil == 3.1.1 03:04:20 INFO - requests == 1.2.3 03:04:20 INFO - wsgiref == 0.1.2 03:04:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:04: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')]} 03:04:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04: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')]} 03:04:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:20 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:20 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 03:04:20 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 03:04:20 INFO - Using env: {'DISPLAY': ':0', 03:04:20 INFO - 'HOME': '/home/cltbld', 03:04:20 INFO - 'LANG': 'en_US.UTF-8', 03:04:20 INFO - 'LANGUAGE': 'en_US:en', 03:04:20 INFO - 'LOGNAME': 'cltbld', 03:04:20 INFO - 'MAIL': '/var/mail/cltbld', 03:04:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:20 INFO - 'MOZ_NO_REMOTE': '1', 03:04:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:20 INFO - 'NO_EM_RESTART': '1', 03:04:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:20 INFO - 'PWD': '/builds/slave/test', 03:04:20 INFO - 'SHELL': '/bin/bash', 03:04:20 INFO - 'SHLVL': '1', 03:04:20 INFO - 'TERM': 'linux', 03:04:20 INFO - 'TMOUT': '86400', 03:04:20 INFO - 'USER': 'cltbld', 03:04:20 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:20 INFO - '_': '/tools/buildbot/bin/python'} 03:04:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 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)) 03:04:20 INFO - Cleaning up... 03:04:20 INFO - Return code: 0 03:04:20 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:04: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')]} 03:04:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04: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')]} 03:04:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:20 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:20 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 03:04:20 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 03:04:20 INFO - Using env: {'DISPLAY': ':0', 03:04:20 INFO - 'HOME': '/home/cltbld', 03:04:20 INFO - 'LANG': 'en_US.UTF-8', 03:04:20 INFO - 'LANGUAGE': 'en_US:en', 03:04:20 INFO - 'LOGNAME': 'cltbld', 03:04:20 INFO - 'MAIL': '/var/mail/cltbld', 03:04:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:20 INFO - 'MOZ_NO_REMOTE': '1', 03:04:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:20 INFO - 'NO_EM_RESTART': '1', 03:04:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:20 INFO - 'PWD': '/builds/slave/test', 03:04:20 INFO - 'SHELL': '/bin/bash', 03:04:20 INFO - 'SHLVL': '1', 03:04:20 INFO - 'TERM': 'linux', 03:04:20 INFO - 'TMOUT': '86400', 03:04:20 INFO - 'USER': 'cltbld', 03:04:20 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:20 INFO - '_': '/tools/buildbot/bin/python'} 03:04:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:20 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:04:20 INFO - Cleaning up... 03:04:20 INFO - Return code: 0 03:04:20 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 03:04: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')]} 03:04:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:04:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04: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')]} 03:04:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:04:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:04:20 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 0x7f5e1813af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24ee8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25bb020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, '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': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', '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 03:04:20 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 03:04:20 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 03:04:20 INFO - Using env: {'DISPLAY': ':0', 03:04:20 INFO - 'HOME': '/home/cltbld', 03:04:20 INFO - 'LANG': 'en_US.UTF-8', 03:04:20 INFO - 'LANGUAGE': 'en_US:en', 03:04:20 INFO - 'LOGNAME': 'cltbld', 03:04:20 INFO - 'MAIL': '/var/mail/cltbld', 03:04:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:20 INFO - 'MOZ_NO_REMOTE': '1', 03:04:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:20 INFO - 'NO_EM_RESTART': '1', 03:04:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:20 INFO - 'PWD': '/builds/slave/test', 03:04:20 INFO - 'SHELL': '/bin/bash', 03:04:20 INFO - 'SHLVL': '1', 03:04:20 INFO - 'TERM': 'linux', 03:04:20 INFO - 'TMOUT': '86400', 03:04:20 INFO - 'USER': 'cltbld', 03:04:20 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:20 INFO - '_': '/tools/buildbot/bin/python'} 03:04:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:04:20 INFO - Downloading/unpacking flake8 03:04:20 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 03:04:20 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 03:04:20 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 03:04:20 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 03:04:20 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 03:04:20 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 03:04:22 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 03:04:22 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 03:04:22 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 03:04:22 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 03:04:22 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 03:04:22 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 03:04:22 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 03:04:22 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 03:04:23 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 03:04:23 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 03:04:23 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 03:04:23 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 03:04:23 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 03:04:23 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 03:04:23 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 03:04:23 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 03:04:23 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 03:04:23 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 03:04:23 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 03:04:23 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 03:04:23 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 03:04:23 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 03:04:23 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 03:04:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 03:04:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:04:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:04:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:04:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:04:23 INFO - no previously-included directories found matching 'docs/_build' 03:04:23 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 03:04:23 INFO - Running setup.py install for pep8 03:04:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:04:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:04:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:04:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:04:23 INFO - no previously-included directories found matching 'docs/_build' 03:04:23 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 03:04:23 INFO - Successfully installed flake8 mccabe pyflakes pep8 03:04:23 INFO - Cleaning up... 03:04:23 INFO - Return code: 0 03:04:23 INFO - Running post-action listener: _resource_record_post_action 03:04:23 INFO - Running post-action listener: _start_resource_monitoring 03:04:23 INFO - Starting resource monitoring. 03:04:23 INFO - ##### 03:04:23 INFO - ##### Finished create-virtualenv step (success) 03:04:23 INFO - ##### 03:04:23 INFO - ##### 03:04:23 INFO - ##### Running install step. 03:04:23 INFO - ##### 03:04:23 INFO - Running pre-action listener: _resource_record_pre_action 03:04:23 INFO - Running main action method: install 03:04:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:04:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:04:24 INFO - Reading from file tmpfile_stdout 03:04:24 INFO - Detecting whether we're running mozinstall >=1.0... 03:04:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:04:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:04:24 INFO - Reading from file tmpfile_stdout 03:04:24 INFO - Output received: 03:04:24 INFO - Usage: mozinstall [options] installer 03:04:24 INFO - Options: 03:04:24 INFO - -h, --help show this help message and exit 03:04:24 INFO - -d DEST, --destination=DEST 03:04:24 INFO - Directory to install application into. [default: 03:04:24 INFO - "/builds/slave/test"] 03:04:24 INFO - --app=APP Application being installed. [default: firefox] 03:04:24 INFO - mkdir: /builds/slave/test/build/application 03:04:24 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'] 03:04:24 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 03:04:40 INFO - Reading from file tmpfile_stdout 03:04:40 INFO - Output received: 03:04:40 INFO - /builds/slave/test/build/application/firefox/firefox 03:04:40 INFO - Running post-action listener: _resource_record_post_action 03:04:40 INFO - ##### 03:04:40 INFO - ##### Finished install step (success) 03:04:40 INFO - ##### 03:04:40 INFO - ##### 03:04:40 INFO - ##### Running run-tests step. 03:04:40 INFO - ##### 03:04:40 INFO - Running pre-action listener: _resource_record_pre_action 03:04:40 INFO - Running main action method: run_tests 03:04:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:04:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:04:40 INFO - Python 2.7.3 03:04:40 INFO - Return code: 0 03:04:40 INFO - grabbing minidump binary from tooltool 03:04:40 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')]} 03:04:40 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 0x264d2e0>, '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 0x25b9140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b95d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:04:40 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 03:04:40 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 03:04:40 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 03:04:40 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:04:40 INFO - Return code: 0 03:04:40 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:04:40 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:04:40 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:04:40 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:04:40 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:04:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 03:04:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 03:04:41 INFO - Return code: 0 03:04:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-028', '--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 03:04:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-028 --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 03:04:41 INFO - Using env: {'DISPLAY': ':0', 03:04:41 INFO - 'HOME': '/home/cltbld', 03:04:41 INFO - 'LANG': 'en_US.UTF-8', 03:04:41 INFO - 'LANGUAGE': 'en_US:en', 03:04:41 INFO - 'LOGNAME': 'cltbld', 03:04:41 INFO - 'MAIL': '/var/mail/cltbld', 03:04:41 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:04:41 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:04:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:04:41 INFO - 'MOZ_NO_REMOTE': '1', 03:04:41 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:04:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:04:41 INFO - 'NO_EM_RESTART': '1', 03:04:41 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:04:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:04:41 INFO - 'PWD': '/builds/slave/test', 03:04:41 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:04:41 INFO - 'SHELL': '/bin/bash', 03:04:41 INFO - 'SHLVL': '1', 03:04:41 INFO - 'TERM': 'linux', 03:04:41 INFO - 'TMOUT': '86400', 03:04:41 INFO - 'USER': 'cltbld', 03:04:41 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461', 03:04:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:04:41 INFO - '_': '/tools/buildbot/bin/python'} 03:04:41 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-028', '--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 03:04:41 INFO - mozversion application_buildid: 20160616024225 03:04:41 INFO - mozversion application_changeset: ccae8d5e75869480d64882bc6f797e3433a8d00c 03:04:41 INFO - mozversion application_display_name: Nightly 03:04:41 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:04:41 INFO - mozversion application_name: Firefox 03:04:41 INFO - mozversion application_remotingname: firefox 03:04:41 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 03:04:41 INFO - mozversion application_vendor: Mozilla 03:04:41 INFO - mozversion application_version: 50.0a1 03:04:41 INFO - mozversion platform_buildid: 20160616024225 03:04:41 INFO - mozversion platform_changeset: ccae8d5e75869480d64882bc6f797e3433a8d00c 03:04:41 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 03:04:41 INFO - mozversion platform_version: 50.0a1 03:04:41 INFO - using testdate: 1466071481 03:04:41 INFO - actual date: 1466071481 03:04:41 INFO - starting webserver on 'localhost:51806' 03:04:41 INFO - SUITE-START | Running 2 tests 03:04:41 INFO - TEST-START | dromaeo_css 03:04:41 INFO - operating with platform_type : linux_ 03:04:41 INFO - Initialising browser for dromaeo_css test... 03:04:41 INFO - TEST-INFO | started process 1471 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYYwuBr/profile http://localhost:51806/getInfo.html) 03:04:46 INFO - PROCESS | 1471 | __metrics Screen width/height:1600/1200 03:04:46 INFO - PROCESS | 1471 | colorDepth:24 03:04:46 INFO - PROCESS | 1471 | Browser inner width/height: 1024/697 03:04:46 INFO - PROCESS | 1471 | __metrics 03:04:47 ERROR - PROCESS | 1471 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 03:04:48 INFO - TEST-INFO | 1471: exit 0 03:04:48 INFO - Browser initialized. 03:04:48 INFO - Running cycle 1/1 for dromaeo_css test... 03:04:48 INFO - TEST-INFO | started process 1590 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYYwuBr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:05:00 INFO - PROCESS | 1590 | RSS: Main: 185917440 03:05:00 INFO - PROCESS | 1590 | 03:05:50 INFO - PROCESS | 1590 | 1466071550111 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] 03:08:02 INFO - PROCESS | 1590 | Cycle 1(1): loaded http://localhost:51806/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51806/tests/dromaeo/cssquery-ext.html) 03:08:03 INFO - PROCESS | 1590 | RSS: Main: 190001152 03:08:03 INFO - PROCESS | 1590 | 03:11:05 INFO - PROCESS | 1590 | Cycle 1(1): loaded http://localhost:51806/tests/dromaeo/cssquery-ext.html (next: http://localhost:51806/tests/dromaeo/cssquery-jquery.html) 03:11:06 INFO - PROCESS | 1590 | RSS: Main: 188284928 03:11:06 INFO - PROCESS | 1590 | 03:14:08 INFO - PROCESS | 1590 | Cycle 1(1): loaded http://localhost:51806/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51806/tests/dromaeo/cssquery-mootools.html) 03:14:09 INFO - PROCESS | 1590 | RSS: Main: 189243392 03:14:09 INFO - PROCESS | 1590 | 03:17:10 INFO - PROCESS | 1590 | Cycle 1(1): loaded http://localhost:51806/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51806/tests/dromaeo/cssquery-prototype.html) 03:17:11 INFO - PROCESS | 1590 | RSS: Main: 186769408 03:17:11 INFO - PROCESS | 1590 | 03:20:14 INFO - PROCESS | 1590 | Cycle 1(1): loaded http://localhost:51806/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51806/tests/dromaeo/cssquery-yui.html) 03:20:14 INFO - PROCESS | 1590 | RSS: Main: 189571072 03:20:14 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | Cycle 1(1): loaded http://localhost:51806/tests/dromaeo/cssquery-yui.html (next: http://localhost:51806/tests/dromaeo/cssquery-dojo.html) 03:23:17 INFO - PROCESS | 1590 | RSS: Main: 190173184 03:23:17 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | __start_tp_report 03:23:17 INFO - PROCESS | 1590 | _x_x_mozilla_page_load 03:23:17 INFO - PROCESS | 1590 | _x_x_mozilla_page_load_details 03:23:17 INFO - PROCESS | 1590 | |i|pagename|runs| 03:23:17 INFO - PROCESS | 1590 | |0;dojo.html;2653.9203823885277;2689.166358428887;2705.6753189617248;2706.6481357423545;2720;4836.758162091899;4842.29786680931;4863.148948933936;4920.8031678732805;4978.502149785019;4804.447488538819;4932.8520144395725;4960.8015679372875;5001;5058.69647821131;4551.840685575998;4585.105904348653;4622.352870598119;4643.628509719214;4675.812967481296;375.52309747510907;4404.97797511012;4471.530489298626;4520.412346394964;4549.454065512126;4496.325551167319;4498.392716983198;4541.091781643651;4541.659375546814;4586.862394128181;4530.433695788027;4532.4787649420405;4533.659975501818;4540.636749060067;4569.405977222973;4408.845690400821;4415.161119387306;4419.64642828573;4429.623482004034;4440.444944381952;4730.408698912636;4818.246046988346;4836.129496690594;4861.6596838220985;4903.65674402792;5226.55574276187;5242.292290540767;5247.055530004636;5251.369835619712;5298.231756395339;5313.1764576490705;5338.359396872362;5353.491418315254;5364.007658583136;5430.728463576806;4957.182064959277;4968.925466118048;4980.651354405157;4981.103401387785;4998.90002199954;5287.101192797234;5323.3079699639575;5386.946130538723;5387.272718182995;5392.137258038773;5180.922286165711;5201.973990130025;5211.765470553834;5221.712805795718;5240.240165176028;5271.314729085195;5284.339457567804;5286.814961476407;5287.101192797157;5340.439253878365;5137.768800403991;5213.374395072616;5225.085610018232;5225.9738701307015;5261.3686357637325;5235;5247.317848679647;5262.421133675292;5270.7628156733035;5271.5255626992985;4420.138073075784;4422.3808666786035;4425.22558552252;4428.490723566831;4488;3782.3380908340932;3814.275287695329;3832.1760821423527;3851.345271303885;3875.6899448044087;4521.0279789845345;4542.364069030338;4543.931841022388;4568.954310456853;4624.237000894815;5329.600279979017;5362.973185134049;5364;5370.194470829407;5382.085045542267;4413.889652758707;4515.638748900145;4529.275315949432;4561;4578.473475550354;4667.393238878924;4683.5082316356975;4726.881827954328;4735.644826638016;4782.163121453732;4830.203016502238;4892.559669629751;4896.069746748107;4897.118518666674;4962.7022378656675;5209.895802084013;5241.842744717665;5289.7355132242465;5298.629095963245;5302.655327403706;4923.630727695366;4941.555260026615;4952.590078850069;4967.925481117858;4986.6509344347;5064.215046667772;5160.896782064413;5188.403333616531;5192.688438693691;5211.296474975829;5260.316158899319;5301.4168441472175;5308.654937429054;5332.9733351333;5385.596080294072;5197.402298735694;5207.29701490294;5216.765245563883;5228.712420816892;5281.075811732854;5086.491350865032;5105.642605017613;5106.565941894981;5205.6356055075785;5212.869678258074;5016.774245158904;5047.772850221675;5050;5067.670601410897;5083.161278389172;5210.869728256824;5212;5215.582753379645;5215.739213039409;5254.7898084076205;4974.228994505857;4974.801007959641;5022.296878437095;5074.441811400669;5114.46298138705 03:23:17 INFO - PROCESS | 1590 | |1;ext.html;539.8161427597396;574.2563380422354;592.6207227374481;597.7997370880756;615.9568830181889;36705.449418258715;37493.062673433174;40414.59585404145;40446.59553404465;40586.59413405865;40249.597504024954;40811.79594102025;40829.795851020775;41024.179516409655;41115.58884411155;7942.086660034083;8016.078151012621;8054.919450805505;8056.35549156069;8082.515049097073;7831.29518343349;7940.761777146695;7963.641636126359;7967.3626109911065;7985.520868747864;7947.443678942476;7953.801154971115;7960.283574478296;7992.080910695287;8026.799330016738;7858.921410785876;7896.289333959942;7984.081830589498;7994.040715114194;8016.959915200387;7876.094249161362;7902.20977902211;7928.484648497829;7937.72217972374;7937.920620793833;38660.22679546393;39035.60964390348;39084.218315633814;39205;39232.60767392318;2553.872306384692;2911.1557648281973;2977;3067.6165479315086;3109.144985129085;28001.299967500974;28345.291367715767;28517.71482285192;28654.856725716447;29256.268593285124;3371.3257348530146;3383.813890236036;3385.509101180315;3423.8801641942414;3433.8798142064907;210819;210848;210913;211270;213129;31991.360172796412;32482.837585811918;32485.350292994008;32495.837520812245;32551;32487.675123248464;33331.500027499605;33463.83268083644;34968;35176;13443.596692099252;13498.190108593515;13512.189268643717;13527.932360338134;13566.186028838103;10320.587176513005;10383.636572719919;10396;10403.791924161475;10430.634927777492;18299.90850045741;18344.541386465444;18426;18512;18547.2380123888;6754.729810807513;6766.966165169241;6824.658767061726;6905.965470172617;7173.96413017942;784.3842583571869;901.4591245252795;903.2051794420868;903.6656437118309;965.3483898368573;27876.44247115046;28445.857770711013;28545.857270713514;28607.57088643672;28748.425031499253;918.7749001494676;959.4435227567993;963.1764841060932;980.3921568627496;996;14987.250637468083;15184.696306073816;15504.30230639624;15630.531084067496;15720.135392553291;409228;414639;421213;422713;685403;50322.496775032516;50376;50885.745571272644;51090;51097.744511277946;1138.459231864874;1160.5763896177834;1189.542026319873;1197.988020119805;1201.0271679939276;27806.165815025583;28955.27611809637;29125.85437072801;29402.852985734935;29647;43030.35454468123;43352;43692;43791.90520236892;43792;276069;276736;277218;278347;278553;25789.097381591553;25916.09293674712;26103.216903492925;26280.21159365222;26491;42397.36403954005;42729.14541709086;43057.784711076245;43214;43577.346339804295;36518;36709.63290367062;36854.8157259212;36914.077148070435;37319.27861317858;35962.46056309105;36465.81767091148;36517.634823651424;36575;36652;35434.29131417305;35440.46839297464;35866.28267434689;36025.81987090048;36229;32127.67872321247;33183.668163318056;33302.66697332996;33346.33307333888;33692;25287.11495097663;25424.618630720182;25514.74485255198;25640;25757.689366105424 03:23:17 INFO - PROCESS | 1590 | |2;jquery.html;366.9376206044972;370.6960292560102;371.30195232962035;384.2161989541336;386.9226154769045;15860;16525.586860328483;17179.656406871854;17203.139843007848;17216.053117078554;15496.14771187587;16083.678326433494;16616.83383166168;16640;16642.75035874463;5016.57359124474;5172.043172013171;5213.191955246943;5238.8690282742855;5241.9213711794355;3712.2204337089242;5119.308893299394;5835.737391817357;6190.442860142586;6199.5350348723805;6108.938910610904;6126.8468288292925;6130.203073600425;6135.9693201534155;6170.50635949123;4954.380702412199;5299.966506531208;5302.787888484456;5366.812161574365;5382.865428364322;5097.6941383517105;5226.817061402832;5348.893022139574;5358;5365.892682146336;12064.758704825943;12070.517179312817;12280.570180043745;19551.80448195514;19704.507387315432;1768.8142745011846;1848.7596612440432;2197.3847322749657;2226.5769503794227;2385.2248019393764;9062.728118156467;9131.863022054675;9193.126652967958;11927.628322742908;11945.581904633296;1642.1953242911006;1679.6472740724462;1731.3853581978342;1732.02140790453;1767.1782621081131;66286;66859;67638.66180669065;68172.3182768171;69304.65347673229;10062.295639305325;10087.546060427298;10091.293609447268;10225.181985441146;10314.329568578169;13687.178769273876;13752.106113102616;13803.930980345034;13816.101953372998;13960.441582336593;6569.80290591283;6789.456843452512;6797.796066118024;6821.761238356634;6924.896126558106;6237.937620623827;6248.250209974832;6327.082573026977;6354.4281014708895;6373.298937116913;4316.028893498938;4342.5874541918465;4363;4443.7111587746695;4502.5047244803045;1677.6476939842769;1711.221394265631;1800.5948661551047;1854.4158590044092;1860.5627677495777;754.6566312327877;826.5660528222732;848.2281124176969;862.1938487514194;886.2245535156737;16310.26603802808;16322.918385407997;16398;16429.6714065718;16515.752263716055;913.1097180249204;920.802027564077;940.9529523523796;944.7260294514651;946.9384490008127;9049.411788233743;9103.317251206186;9243.445393276425;9417.38786978858;9532.428054316762;357344;364956;365159;366107;370408;61116;72575.27424725791;73668.63165684137;75047.62476187584;76317.23682763102;823.1562648285436;857.7769779857282;862.1120246146479;864.8702694595735;883.5670521444574;14829.480968166063;14945.925270373578;14966.92516537454;15144.505227207572;15278.541643750705;31369.21576960503;33538.49692254667;34605.30789384249;36024.81987590045;37912.43131353087;51504;51658.74170629123;51805.7409712949;51822.74088629533;51842.74078629583;6597.901031484627;6916.377526022682;7611.847763044819;7770.3766259075755;7916.802079948047;11024.944875275572;11509.194356395306;11623.535058597561;12110.27338359666;12257.448414821176;9278.95360523193;10100.242481813746;10136.543855526666;10139.08748212635;10350.896491034993;10321;10411.583536658449;10464.162866970777;10493.422861742678;10608.840867387149;10512.369257844553;10709.732256693333;10764.246502744732;10788.460576971276;11004.284721493077;7343.742968996059;7376.4098872089035;7538.3969282458365;7549.773506794805;7647.235276472308;7222.133343998754;8700.477971321741;9968.750781230527;10533.36799792015;10646.467676615983 03:23:17 INFO - PROCESS | 1590 | |3;mootools.html;1325.8276424064873;1356.2879488268659;1426.6647337875597;1626.3901037111084;1668.0992264177337;7009.334113259232;7721.575313357763;7729.72945946892;8270.214329638675;8288.70989515367;7894;7958.124606293318;8029.9197008029905;8033.839323213532;8048.678052877878;2200.251914349125;2244.2145249162745;2250.1224522436264;2251.8536295140843;2254.199759085526;2179.3897708641607;2199.406160336708;2252.9436764080865;2257.5372048730055;2257.9096836126537;2218.267971569378;2233.7542870284256;2234.698315727372;2236.083205885587;2263.0495192019393;2158.2446143849606;2160.6975023496725;2172.869627822328;2175.7497887742798;2180.509385388291;2087.3842216546154;2096.7693553709078;2109.4620871677776;2109.504266497372;2113.7357830271217;7897.210278972057;7927.405444591621;7985.800354991114;8008.079070906862;8074.919250807476;4448.33275008748;4517.9774101129615;4548.0903819235955;4565.885852853672;4571.817127314936;2766.667999840012;2828.9292767680768;2945.5434407666844;2962.5111856543645;2984.5224764037866;879.612970293069;910.6858133943845;930.1489137439303;936.4849332866896;941.2093841173447;10979.451027448675;11002.33985960845;11123.833142502868;11144.60993865219;11159.38623375722;4155.2728272552185;4227.32362821947;4282.721623094489;4317.11499142675;4326.502452217972;9399.154076133043;9460.57427415768;9472.815898012748;9491.90508094924;9500.619975201053;4496.168208881368;4522.276435770326;4532.864014079583;4533.5013148553635;4539.909201815945;3495.8601655933476;4044.4742183515955;4087.795610219477;4138.399932009842;4159.459270294842;3658.743887927873;3665.9450108248398;3697.6117507661847;3785.488958990556;3875.496185495924;1195.964121076369;1212.775636507249;1223.9449224784728;1228.975420491585;1229;714.7784186901973;802.0375549340698;804.9678012879419;822.0341099208406;831.4886344897965;5151.6908985461;5170.431252562215;5253.317068781034;5322.787088516493;5326.5472434842695;376.9981150094232;391.57709673553063;393.8897108809481;399.36301598949626;400.93184158693094;3298.4392653249006;3305.140663427478;3340.88306909257;3349.949750753741;3383.796972181677;9320.30097742672;9472.431654100776;9500.714978550655;9530.332876698703;9612.375195612263;9256;9349;9415.952920235492;9469.10043545862;9473.857892131624;7103.822404439827;7214.96392518034;7246.130464344207;7258.782236532912;7280.526765760209;5448.046591846491;5564.051346679835;5632.2678051853;5664.37691853904;5774.133879918046;9296.95351523238;9317.208037316634;9346.672866449642;9457.668981585612;9487.241020718187;8672.913270867211;9051.592678329624;9063.728088157366;9422.811543768948;9493.762655933657;6105.114758360101;6559.27847936717;6668.333166683293;6813.931860681329;6838.658067096725;7770.145284018867;7805.297523222937;7901.802454938673;7924.960375198318;7975.082865470546;6773;6968.860622787414;7023.578585284899;7093.787186384417;7208.603526806076;6992.916098004817;7003.369696727319;7010.948357746379;7024.121984751906;7026.156861176692;6157.4458298753325;6181.690915454119;6307.148534947907;6313.96843015782;6321.115043893767;4539.251023581072;4545.5908968193025;4579.427571553556;4606.447226332862;4613.308003799457;4647.837325693585;4660.603848672765;4716.127516409475;4730.526947305242;4752.691075080109 03:23:17 INFO - PROCESS | 1590 | |4;prototype.html;283.6822758510467;290.0789991776111;297.23313850266317;297.8808476609356;304.8948112901051;4986.9750651246695;5050.267711181877;5196.5063318984685;5200.583953283733;5266.078436273651;5107.131787596109;5117.897642047166;5128.666636668614;5141.768620412081;5148.382194136709;3951.427043078752;4014.919701605966;4033.1328764315667;4033.556308806036;4041.8989525261954;3968;4033.35466325388;4058.1072164123843;4059.4316795648633;4081.4898137732785;3965.286248475273;3983.183447393277;3986.720929534934;3986.720929534934;3989.261986532501;3962.088719594495;3972.9006774830573;4012.4583181270445;4015.638592526687;4040.616141466556;3542.663446972559;3565.750397472178;3569.5359603251413;3571.6964058055096;3576.964230357715;4863.297845753993;5020.523050310215;5020.974895125538;5022.27177059328;5096.413912400084;4532.297493888453;4579.7710114494475;4585.197590421662;4585.358049873021;4609.446866376056;5331.333583302087;5336.119540275849;5355.651882627617;5362;5376.569874410077;3694.205226971089;3785.1104990327253;3817.770933743984;3831.1954489556947;3856.1323702166787;5615.831525054255;5615.943840561583;5652.18043383707;5674.773009079673;5675.432456754333;3946.052947292629;3949.328614135604;3953.7627742335553;3973.1060511385285;3986.402039694011;3562.73522899367;3849.172427928009;3983.2830090583393;3987.7407968481957;4000;4406.801693923781;4409.779511024436;4411.51473337939;4417.867463976086;4430.62339701129;5332.200169974535;5357.812476563302;5396.325459317585;5413.512783849473;5439.211314359396;1247.544646204147;1301.3168086754529;1330.4545136493991;1330.9600711978655;1331.7215473145695;811.8741595052658;817.8323443694147;826.1160558202786;827.962741676626;830.2278880641062;4157.854475093357;4196.769177695256;4210.284251677161;4225.323948168279;4226.4928208615165;4865.70805751656;4874.488178741252;4875.95124048762;4883.58489528387;4890.437599676012;4180.038591124058;4243.596858298519;4261.637760790368;4271.295236285978;4284.293091639907;2540.2887191586387;2551.757583029609;2606.9869650651626;2643.3920198354103;2643.643108180371;4552.975580494429;4566.20091483989;4573.285018118206;4583.72497650142;4639.353029674485;4939.851804445872;4973.90052198954;4974.204127339608;4976.776045077981;4991.650584459053;4392.8139402361185;4404.2512772828695;4560.156371071429;4565.817367305403;4593.977030114895;4894.657373983787;4909.852704418873;4924.482929292372;4933.4819843915875;4941.43173535048;4810.8797280068275;4819.26506457682;4832.468428472936;4847.200211965127;4847.3698419205275;4563.292689633112;4776.23580227162;5214.243934629381;5237.816676416307;5238.5547228486;3836.1176929306976;3837.2133712588293;3841.1357444574746;3867.1878905430176;3869.0714228584375;5304.761285742074;5566.051881841323;5580.609357345109;5626.606137570495;5658.321001479849;5273.630845840754;5357.544608708304;5363.463653634605;5412.648177868426;5414.214938833926;5317.282166907418;5374.4739972213;5381.13901775714;5391.838244852661;5432.511074003359;5101.51535604117;5209.76556054986;5240.868978275574;5320.813771517978;5321.122014867658;5412.350517937873;5433.9184912225555;5434.592405569519;5461.371942226695;5471.644343117685;5305.681659100466;5310;5313.362396512443;5328.227407025882;5344.35867695879 03:23:17 INFO - PROCESS | 1590 | |5;yui.html;615.9774773875367;637.658852513905;677.759395414628;690.0987778669764;713.7323503686117;12828.615141545757;13173.736525269489;13440.3951822168;13500.189988600667;13678.52125175619;13255.40350684219;13277.136986095897;13321.666958326023;13338.466461341559;13416.262105584188;639.7409049335026;779.8752199648058;781.5115552779513;800.5997001499251;804.1717031457579;786.7167819584945;789.9091604465502;791.6358475101431;795.3239746215728;795.7930937956144;826.1490664615455;826.9586520673972;831.55096248026;834.5743670727911;836.1387770596265;816.6855760532178;826.1614461321764;828.1097819843662;828.6354004238116;829.0548774397192;602.770947040122;605.4006533531816;606.4269265544062;607.0317843040343;607.2348840461007;12857.67855803603;12892.80660790089;12947.417366218542;12951.740965180643;13019.479220831156;13426.664333391645;13604.115732477358;13737.450501979909;13771.798902183265;13908.791368129487;10149.746256343577;10190.286679932407;10233.64182253625;10444.947775261151;10494.265401421828;3373.426517492008;3428.7428442866635;3439.570053743282;3461.13471632092;3504.7721898076543;58086.419135808945;59243;59272.70363648197;59336.40663593352;59400.40599593992;10730.356178629307;10821.188410869216;11001.339919604849;11096.33421994683;11105.555777768799;19863.106160222826;19975.400737977885;20124.29564965219;20162.29431969874;20191.697124543145;6623.205215374186;6729.0915726376315;6730.528862979642;6792.320767923267;6795.490338224653;3597.784132952031;3618.2401695644207;3639.3631114554846;3650.123970247175;3684.9263014739554;2819.8590070496803;2895.1459319500796;2927.238917881366;2931.428371467586;2939.9269266717492;473.2309996256084;474.69856641032504;481.41748484333647;485.85667228167773;487.2204472843493;460.35320374872686;490.2450226650989;509.89292248628203;513.6481510165548;515.5411683601598;7789.688412463438;7837;7870.921290787133;7878;7966.362690984707;502.4473079612397;502.6531693131727;504.5433882336491;507.14292845091677;510.9080365534239;3581.1047238190454;3759.6240375962184;3777.981110094432;3789.2232092420986;3848.422736589534;87393.5630321857;89329;90183;90472;95502;55601.721991389786;78859.21140788519;79764;80578;80621.59689201516;43226;43300.13399731988;43775.104404421465;64897.02654460092;69844.30155698479;7258.45561582894;7285.599292038989;7303.817404564928;7544.622768861425;7621.352185064332;42330;43225.56774432216;43380.34929475997;44181.33727994147;44313.33529997117;53794.46205537894;60804.69597651983;61296.38703612907;61927.233825573;62250.68874655598;9240.537973101184;9395.342326037111;9507.477088760184;9525.904740952501;9754.219662427131;10287.33132346425;10309.536070876979;10353.896461035594;10360.948195258976;10889.183311251847;9934.105930466003;10007.54966026516;10063.547140378554;10109.898901011189;10215.795684086424;9477;9517.619295228113;9563.330566860253;9643.180329672057;9661.178799802095;9831.164351030242;9998.350107243006;10037.89962100399;10130.493475326057;10408.947955260175;8697.21725044749;8757.649694012423;8810.427322224035;8877.511736854534;8914.73255802327;8643.697470588499;8796;8801.779955501164;9190.080991900757;9190.494522801042 03:23:17 INFO - PROCESS | 1590 | __end_tp_report 03:23:17 INFO - PROCESS | 1590 | __start_cc_report 03:23:17 INFO - PROCESS | 1590 | _x_x_mozilla_cycle_collect,381 03:23:17 INFO - PROCESS | 1590 | __end_cc_report 03:23:17 INFO - PROCESS | 1590 | __startTimestamp1466072597443__endTimestamp 03:23:17 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | ------- Summary: start ------- 03:23:17 INFO - PROCESS | 1590 | Number of tests: 6 03:23:17 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | [#0] dojo.html Cycles:165 Average:4841.47 Median:4981.10 stddev:634.21 (12.7%) stddev-sans-first:612.50 03:23:17 INFO - PROCESS | 1590 | Values: 2653.9 2689.2 2705.7 2706.6 2720.0 4836.8 4842.3 4863.1 4920.8 4978.5 4804.4 4932.9 4960.8 5001.0 5058.7 4551.8 4585.1 4622.4 4643.6 4675.8 375.5 4405.0 4471.5 4520.4 4549.5 4496.3 4498.4 4541.1 4541.7 4586.9 4530.4 4532.5 4533.7 4540.6 4569.4 4408.8 4415.2 4419.6 4429.6 4440.4 4730.4 4818.2 4836.1 4861.7 4903.7 5226.6 5242.3 5247.1 5251.4 5298.2 5313.2 5338.4 5353.5 5364.0 5430.7 4957.2 4968.9 4980.7 4981.1 4998.9 5287.1 5323.3 5386.9 5387.3 5392.1 5180.9 5202.0 5211.8 5221.7 5240.2 5271.3 5284.3 5286.8 5287.1 5340.4 5137.8 5213.4 5225.1 5226.0 5261.4 5235.0 5247.3 5262.4 5270.8 5271.5 4420.1 4422.4 4425.2 4428.5 4488.0 3782.3 3814.3 3832.2 3851.3 3875.7 4521.0 4542.4 4543.9 4569.0 4624.2 5329.6 5363.0 5364.0 5370.2 5382.1 4413.9 4515.6 4529.3 4561.0 4578.5 4667.4 4683.5 4726.9 4735.6 4782.2 4830.2 4892.6 4896.1 4897.1 4962.7 5209.9 5241.8 5289.7 5298.6 5302.7 4923.6 4941.6 4952.6 4967.9 4986.7 5064.2 5160.9 5188.4 5192.7 5211.3 5260.3 5301.4 5308.7 5333.0 5385.6 5197.4 5207.3 5216.8 5228.7 5281.1 5086.5 5105.6 5106.6 5205.6 5212.9 5016.8 5047.8 5050.0 5067.7 5083.2 5210.9 5212.0 5215.6 5215.7 5254.8 4974.2 4974.8 5022.3 5074.4 5114.5 03:23:17 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | [#1] ext.html Cycles:180 Average:46560.72 Median:36347.41 stddev:91542.69 (251.9%) stddev-sans-first:91734.28 03:23:17 INFO - PROCESS | 1590 | Values: 539.8 574.3 592.6 597.8 616.0 36705.4 37493.1 40414.6 40446.6 40586.6 40249.6 40811.8 40829.8 41024.2 41115.6 7942.1 8016.1 8054.9 8056.4 8082.5 7831.3 7940.8 7963.6 7967.4 7985.5 7947.4 7953.8 7960.3 7992.1 8026.8 7858.9 7896.3 7984.1 7994.0 8017.0 7876.1 7902.2 7928.5 7937.7 7937.9 38660.2 39035.6 39084.2 39205.0 39232.6 2553.9 2911.2 2977.0 3067.6 3109.1 28001.3 28345.3 28517.7 28654.9 29256.3 3371.3 3383.8 3385.5 3423.9 3433.9 210819.0 210848.0 210913.0 211270.0 213129.0 31991.4 32482.8 32485.4 32495.8 32551.0 32487.7 33331.5 33463.8 34968.0 35176.0 13443.6 13498.2 13512.2 13527.9 13566.2 10320.6 10383.6 10396.0 10403.8 10430.6 18299.9 18344.5 18426.0 18512.0 18547.2 6754.7 6767.0 6824.7 6906.0 7174.0 784.4 901.5 903.2 903.7 965.3 27876.4 28445.9 28545.9 28607.6 28748.4 918.8 959.4 963.2 980.4 996.0 14987.3 15184.7 15504.3 15630.5 15720.1 409228.0 414639.0 421213.0 422713.0 685403.0 50322.5 50376.0 50885.7 51090.0 51097.7 1138.5 1160.6 1189.5 1198.0 1201.0 27806.2 28955.3 29125.9 29402.9 29647.0 43030.4 43352.0 43692.0 43791.9 43792.0 276069.0 276736.0 277218.0 278347.0 278553.0 25789.1 25916.1 26103.2 26280.2 26491.0 42397.4 42729.1 43057.8 43214.0 43577.3 36518.0 36709.6 36854.8 36914.1 37319.3 35962.5 36465.8 36517.6 36575.0 36652.0 35434.3 35440.5 35866.3 36025.8 36229.0 32127.7 33183.7 33302.7 33346.3 33692.0 25287.1 25424.6 25514.7 25640.0 25757.7 03:23:17 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | [#2] jquery.html Cycles:180 Average:23173.93 Median:4352.79 stddev:60283.97 (1384.9%) stddev-sans-first:60428.76 03:23:17 INFO - PROCESS | 1590 | Values: 366.9 370.7 371.3 384.2 386.9 15860.0 16525.6 17179.7 17203.1 17216.1 15496.1 16083.7 16616.8 16640.0 16642.8 5016.6 5172.0 5213.2 5238.9 5241.9 3712.2 5119.3 5835.7 6190.4 6199.5 6108.9 6126.8 6130.2 6136.0 6170.5 4954.4 5300.0 5302.8 5366.8 5382.9 5097.7 5226.8 5348.9 5358.0 5365.9 12064.8 12070.5 12280.6 19551.8 19704.5 1768.8 1848.8 2197.4 2226.6 2385.2 9062.7 9131.9 9193.1 11927.6 11945.6 1642.2 1679.6 1731.4 1732.0 1767.2 66286.0 66859.0 67638.7 68172.3 69304.7 10062.3 10087.5 10091.3 10225.2 10314.3 13687.2 13752.1 13803.9 13816.1 13960.4 6569.8 6789.5 6797.8 6821.8 6924.9 6237.9 6248.3 6327.1 6354.4 6373.3 4316.0 4342.6 4363.0 4443.7 4502.5 1677.6 1711.2 1800.6 1854.4 1860.6 754.7 826.6 848.2 862.2 886.2 16310.3 16322.9 16398.0 16429.7 16515.8 913.1 920.8 941.0 944.7 946.9 9049.4 9103.3 9243.4 9417.4 9532.4 357344.0 364956.0 365159.0 366107.0 370408.0 61116.0 72575.3 73668.6 75047.6 76317.2 823.2 857.8 862.1 864.9 883.6 14829.5 14945.9 14966.9 15144.5 15278.5 31369.2 33538.5 34605.3 36024.8 37912.4 51504.0 51658.7 51805.7 51822.7 51842.7 6597.9 6916.4 7611.8 7770.4 7916.8 11024.9 11509.2 11623.5 12110.3 12257.4 9279.0 10100.2 10136.5 10139.1 10350.9 10321.0 10411.6 10464.2 10493.4 10608.8 10512.4 10709.7 10764.2 10788.5 11004.3 7343.7 7376.4 7538.4 7549.8 7647.2 7222.1 8700.5 9968.8 10533.4 10646.5 03:23:17 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | [#3] mootools.html Cycles:180 Average:5191.59 Median:5161.06 stddev:2971.78 (57.6%) stddev-sans-first:2965.92 03:23:17 INFO - PROCESS | 1590 | Values: 1325.8 1356.3 1426.7 1626.4 1668.1 7009.3 7721.6 7729.7 8270.2 8288.7 7894.0 7958.1 8029.9 8033.8 8048.7 2200.3 2244.2 2250.1 2251.9 2254.2 2179.4 2199.4 2252.9 2257.5 2257.9 2218.3 2233.8 2234.7 2236.1 2263.0 2158.2 2160.7 2172.9 2175.7 2180.5 2087.4 2096.8 2109.5 2109.5 2113.7 7897.2 7927.4 7985.8 8008.1 8074.9 4448.3 4518.0 4548.1 4565.9 4571.8 2766.7 2828.9 2945.5 2962.5 2984.5 879.6 910.7 930.1 936.5 941.2 10979.5 11002.3 11123.8 11144.6 11159.4 4155.3 4227.3 4282.7 4317.1 4326.5 9399.2 9460.6 9472.8 9491.9 9500.6 4496.2 4522.3 4532.9 4533.5 4539.9 3495.9 4044.5 4087.8 4138.4 4159.5 3658.7 3665.9 3697.6 3785.5 3875.5 1196.0 1212.8 1223.9 1229.0 1229.0 714.8 802.0 805.0 822.0 831.5 5151.7 5170.4 5253.3 5322.8 5326.5 377.0 391.6 393.9 399.4 400.9 3298.4 3305.1 3340.9 3349.9 3383.8 9320.3 9472.4 9500.7 9530.3 9612.4 9256.0 9349.0 9416.0 9469.1 9473.9 7103.8 7215.0 7246.1 7258.8 7280.5 5448.0 5564.1 5632.3 5664.4 5774.1 9297.0 9317.2 9346.7 9457.7 9487.2 8672.9 9051.6 9063.7 9422.8 9493.8 6105.1 6559.3 6668.3 6813.9 6838.7 7770.1 7805.3 7901.8 7925.0 7975.1 6773.0 6968.9 7023.6 7093.8 7208.6 6992.9 7003.4 7010.9 7024.1 7026.2 6157.4 6181.7 6307.1 6314.0 6321.1 4539.3 4545.6 4579.4 4606.4 4613.3 4647.8 4660.6 4716.1 4730.5 4752.7 03:23:17 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | [#4] prototype.html Cycles:180 Average:4311.24 Median:4707.79 stddev:1262.19 (26.8%) stddev-sans-first:1228.99 03:23:17 INFO - PROCESS | 1590 | Values: 283.7 290.1 297.2 297.9 304.9 4987.0 5050.3 5196.5 5200.6 5266.1 5107.1 5117.9 5128.7 5141.8 5148.4 3951.4 4014.9 4033.1 4033.6 4041.9 3968.0 4033.4 4058.1 4059.4 4081.5 3965.3 3983.2 3986.7 3986.7 3989.3 3962.1 3972.9 4012.5 4015.6 4040.6 3542.7 3565.8 3569.5 3571.7 3577.0 4863.3 5020.5 5021.0 5022.3 5096.4 4532.3 4579.8 4585.2 4585.4 4609.4 5331.3 5336.1 5355.7 5362.0 5376.6 3694.2 3785.1 3817.8 3831.2 3856.1 5615.8 5615.9 5652.2 5674.8 5675.4 3946.1 3949.3 3953.8 3973.1 3986.4 3562.7 3849.2 3983.3 3987.7 4000.0 4406.8 4409.8 4411.5 4417.9 4430.6 5332.2 5357.8 5396.3 5413.5 5439.2 1247.5 1301.3 1330.5 1331.0 1331.7 811.9 817.8 826.1 828.0 830.2 4157.9 4196.8 4210.3 4225.3 4226.5 4865.7 4874.5 4876.0 4883.6 4890.4 4180.0 4243.6 4261.6 4271.3 4284.3 2540.3 2551.8 2607.0 2643.4 2643.6 4553.0 4566.2 4573.3 4583.7 4639.4 4939.9 4973.9 4974.2 4976.8 4991.7 4392.8 4404.3 4560.2 4565.8 4594.0 4894.7 4909.9 4924.5 4933.5 4941.4 4810.9 4819.3 4832.5 4847.2 4847.4 4563.3 4776.2 5214.2 5237.8 5238.6 3836.1 3837.2 3841.1 3867.2 3869.1 5304.8 5566.1 5580.6 5626.6 5658.3 5273.6 5357.5 5363.5 5412.6 5414.2 5317.3 5374.5 5381.1 5391.8 5432.5 5101.5 5209.8 5240.9 5320.8 5321.1 5412.4 5433.9 5434.6 5461.4 5471.6 5305.7 5310.0 5313.4 5328.2 5344.4 03:23:17 INFO - PROCESS | 1590 | 03:23:17 INFO - PROCESS | 1590 | [#5] yui.html Cycles:180 Average:16247.52 Median:54698.09 stddev:22785.52 (41.7%) stddev-sans-first:22819.20 03:23:17 INFO - PROCESS | 1590 | Values: 616.0 637.7 677.8 690.1 713.7 12828.6 13173.7 13440.4 13500.2 13678.5 13255.4 13277.1 13321.7 13338.5 13416.3 639.7 779.9 781.5 800.6 804.2 786.7 789.9 791.6 795.3 795.8 826.1 827.0 831.6 834.6 836.1 816.7 826.2 828.1 828.6 829.1 602.8 605.4 606.4 607.0 607.2 12857.7 12892.8 12947.4 12951.7 13019.5 13426.7 13604.1 13737.5 13771.8 13908.8 10149.7 10190.3 10233.6 10444.9 10494.3 3373.4 3428.7 3439.6 3461.1 3504.8 58086.4 59243.0 59272.7 59336.4 59400.4 10730.4 10821.2 11001.3 11096.3 11105.6 19863.1 19975.4 20124.3 20162.3 20191.7 6623.2 6729.1 6730.5 6792.3 6795.5 3597.8 3618.2 3639.4 3650.1 3684.9 2819.9 2895.1 2927.2 2931.4 2939.9 473.2 474.7 481.4 485.9 487.2 460.4 490.2 509.9 513.6 515.5 7789.7 7837.0 7870.9 7878.0 7966.4 502.4 502.7 504.5 507.1 510.9 3581.1 3759.6 3778.0 3789.2 3848.4 87393.6 89329.0 90183.0 90472.0 95502.0 55601.7 78859.2 79764.0 80578.0 80621.6 43226.0 43300.1 43775.1 64897.0 69844.3 7258.5 7285.6 7303.8 7544.6 7621.4 42330.0 43225.6 43380.3 44181.3 44313.3 53794.5 60804.7 61296.4 61927.2 62250.7 9240.5 9395.3 9507.5 9525.9 9754.2 10287.3 10309.5 10353.9 10360.9 10889.2 9934.1 10007.5 10063.5 10109.9 10215.8 9477.0 9517.6 9563.3 9643.2 9661.2 9831.2 9998.4 10037.9 10130.5 10408.9 8697.2 8757.6 8810.4 8877.5 8914.7 8643.7 8796.0 8801.8 9190.1 9190.5 03:23:17 INFO - PROCESS | 1590 | -------- Summary: end -------- 03:23:17 INFO - PROCESS | 1590 | 03:23:18 INFO - TEST-INFO | 1590: exit 0 03:23:18 INFO - TEST-OK | dromaeo_css | took 1116910ms 03:23:18 INFO - TEST-START | kraken 03:23:18 INFO - operating with platform_type : linux_ 03:23:18 INFO - Initialising browser for kraken test... 03:23:18 INFO - TEST-INFO | started process 1824 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpQ38msP/profile http://localhost:51806/getInfo.html) 03:23:23 INFO - PROCESS | 1824 | __metrics Screen width/height:1600/1200 03:23:23 INFO - PROCESS | 1824 | colorDepth:24 03:23:23 INFO - PROCESS | 1824 | Browser inner width/height: 1024/697 03:23:23 INFO - PROCESS | 1824 | __metrics 03:23:24 ERROR - PROCESS | 1824 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 03:23:25 INFO - TEST-INFO | 1824: exit 0 03:23:25 INFO - Browser initialized. 03:23:25 INFO - Running cycle 1/1 for kraken test... 03:23:25 INFO - TEST-INFO | started process 1941 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpQ38msP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:23:37 INFO - PROCESS | 1941 | RSS: Main: 186273792 03:23:37 INFO - PROCESS | 1941 | 03:23:39 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51806/tests/kraken/driver.html?testName=audio-beat-detection) 03:23:40 INFO - PROCESS | 1941 | RSS: Main: 190566400 03:23:40 INFO - PROCESS | 1941 | 03:23:43 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51806/tests/kraken/driver.html?testName=audio-dft) 03:23:44 INFO - PROCESS | 1941 | RSS: Main: 191299584 03:23:44 INFO - PROCESS | 1941 | 03:23:47 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51806/tests/kraken/driver.html?testName=audio-fft) 03:23:48 INFO - PROCESS | 1941 | RSS: Main: 186396672 03:23:48 INFO - PROCESS | 1941 | 03:23:50 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51806/tests/kraken/driver.html?testName=audio-oscillator) 03:23:50 INFO - PROCESS | 1941 | RSS: Main: 187314176 03:23:50 INFO - PROCESS | 1941 | 03:23:53 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51806/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:23:53 INFO - PROCESS | 1941 | RSS: Main: 187252736 03:23:53 INFO - PROCESS | 1941 | 03:23:56 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51806/tests/kraken/driver.html?testName=imaging-darkroom) 03:23:57 INFO - PROCESS | 1941 | RSS: Main: 187437056 03:23:57 INFO - PROCESS | 1941 | 03:24:01 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51806/tests/kraken/driver.html?testName=imaging-desaturate) 03:24:01 INFO - PROCESS | 1941 | RSS: Main: 184107008 03:24:01 INFO - PROCESS | 1941 | 03:24:04 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51806/tests/kraken/driver.html?testName=json-parse-financial) 03:24:05 INFO - PROCESS | 1941 | RSS: Main: 186351616 03:24:05 INFO - PROCESS | 1941 | 03:24:06 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51806/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:24:07 INFO - PROCESS | 1941 | RSS: Main: 186789888 03:24:07 INFO - PROCESS | 1941 | 03:24:09 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51806/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:24:10 INFO - PROCESS | 1941 | RSS: Main: 187101184 03:24:10 INFO - PROCESS | 1941 | 03:24:12 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51806/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:24:13 INFO - PROCESS | 1941 | RSS: Main: 187502592 03:24:13 INFO - PROCESS | 1941 | 03:24:15 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51806/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:24:16 INFO - PROCESS | 1941 | RSS: Main: 187535360 03:24:16 INFO - PROCESS | 1941 | 03:24:19 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51806/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:24:20 INFO - PROCESS | 1941 | RSS: Main: 187305984 03:24:20 INFO - PROCESS | 1941 | 03:24:21 INFO - PROCESS | 1941 | Cycle 1(1): loaded http://localhost:51806/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51806/tests/kraken/driver.html?testName=ai-astar) 03:24:22 INFO - PROCESS | 1941 | RSS: Main: 188624896 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | __start_tp_report 03:24:22 INFO - PROCESS | 1941 | _x_x_mozilla_page_load 03:24:22 INFO - PROCESS | 1941 | _x_x_mozilla_page_load_details 03:24:22 INFO - PROCESS | 1941 | |i|pagename|runs| 03:24:22 INFO - PROCESS | 1941 | |0;ai-astar;117;113;114;113;113;113;112;112;114;112 03:24:22 INFO - PROCESS | 1941 | |1;audio-beat-detection;161;133;157;190;137;159;162;132;191;142 03:24:22 INFO - PROCESS | 1941 | |2;audio-dft;166;168;177;164;164;163;166;164;163;161 03:24:22 INFO - PROCESS | 1941 | |3;audio-fft;78;77;76;170;77;75;74;76;160;77 03:24:22 INFO - PROCESS | 1941 | |4;audio-oscillator;87;86;151;87;86;87;136;87;86;130 03:24:22 INFO - PROCESS | 1941 | |5;imaging-gaussian-blur;118;117;117;118;117;117;118;117;118;118 03:24:22 INFO - PROCESS | 1941 | |6;imaging-darkroom;148;148;147;147;148;148;148;181;147;149 03:24:22 INFO - PROCESS | 1941 | |7;imaging-desaturate;96;96;95;95;95;97;95;96;95;96 03:24:22 INFO - PROCESS | 1941 | |8;json-parse-financial;63;64;63;64;63;64;64;63;66;75 03:24:22 INFO - PROCESS | 1941 | |9;json-stringify-tinderbox;64;65;66;65;65;65;65;68;66;65 03:24:22 INFO - PROCESS | 1941 | |10;stanford-crypto-aes;90;84;84;85;88;85;84;86;113;90 03:24:22 INFO - PROCESS | 1941 | |11;stanford-crypto-ccm;146;133;133;137;135;134;134;152;144;135 03:24:22 INFO - PROCESS | 1941 | |12;stanford-crypto-pbkdf2;172;174;169;171;174;175;170;174;170;170 03:24:22 INFO - PROCESS | 1941 | |13;stanford-crypto-sha256-iterative;68;68;72;67;69;66;67;68;67;67 03:24:22 INFO - PROCESS | 1941 | __end_tp_report 03:24:22 INFO - PROCESS | 1941 | __start_cc_report 03:24:22 INFO - PROCESS | 1941 | _x_x_mozilla_cycle_collect,980 03:24:22 INFO - PROCESS | 1941 | __end_cc_report 03:24:22 INFO - PROCESS | 1941 | __startTimestamp1466072662195__endTimestamp 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | ------- Summary: start ------- 03:24:22 INFO - PROCESS | 1941 | Number of tests: 14 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#0] ai-astar Cycles:10 Average:113.30 Median:113.00 stddev:1.49 (1.3%) stddev-sans-first:0.78 03:24:22 INFO - PROCESS | 1941 | Values: 117.0 113.0 114.0 113.0 113.0 113.0 112.0 112.0 114.0 112.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#1] audio-beat-detection Cycles:10 Average:156.40 Median:160.00 stddev:21.38 (13.4%) stddev-sans-first:22.61 03:24:22 INFO - PROCESS | 1941 | Values: 161.0 133.0 157.0 190.0 137.0 159.0 162.0 132.0 191.0 142.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#2] audio-dft Cycles:10 Average:165.60 Median:165.00 stddev:4.45 (2.7%) stddev-sans-first:4.72 03:24:22 INFO - PROCESS | 1941 | Values: 166.0 168.0 177.0 164.0 164.0 163.0 166.0 164.0 163.0 161.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#3] audio-fft Cycles:10 Average:94.00 Median:76.50 stddev:37.51 (49.0%) stddev-sans-first:39.34 03:24:22 INFO - PROCESS | 1941 | Values: 78.0 77.0 76.0 170.0 77.0 75.0 74.0 76.0 160.0 77.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#4] audio-oscillator Cycles:10 Average:102.30 Median:86.50 stddev:25.84 (29.9%) stddev-sans-first:26.80 03:24:22 INFO - PROCESS | 1941 | Values: 87.0 86.0 151.0 87.0 86.0 87.0 136.0 87.0 86.0 130.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#5] imaging-gaussian-blur Cycles:10 Average:117.50 Median:118.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 03:24:22 INFO - PROCESS | 1941 | Values: 118.0 117.0 117.0 118.0 117.0 117.0 118.0 117.0 118.0 118.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#6] imaging-darkroom Cycles:10 Average:151.10 Median:148.00 stddev:10.52 (7.1%) stddev-sans-first:11.10 03:24:22 INFO - PROCESS | 1941 | Values: 148.0 148.0 147.0 147.0 148.0 148.0 148.0 181.0 147.0 149.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.73 03:24:22 INFO - PROCESS | 1941 | Values: 96.0 96.0 95.0 95.0 95.0 97.0 95.0 96.0 95.0 96.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#8] json-parse-financial Cycles:10 Average:64.90 Median:64.00 stddev:3.67 (5.7%) stddev-sans-first:3.82 03:24:22 INFO - PROCESS | 1941 | Values: 63.0 64.0 63.0 64.0 63.0 64.0 64.0 63.0 66.0 75.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#9] json-stringify-tinderbox Cycles:10 Average:65.40 Median:65.00 stddev:1.07 (1.7%) stddev-sans-first:1.01 03:24:22 INFO - PROCESS | 1941 | Values: 64.0 65.0 66.0 65.0 65.0 65.0 65.0 68.0 66.0 65.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#10] stanford-crypto-aes Cycles:10 Average:88.90 Median:85.50 stddev:8.79 (10.3%) stddev-sans-first:9.31 03:24:22 INFO - PROCESS | 1941 | Values: 90.0 84.0 84.0 85.0 88.0 85.0 84.0 86.0 113.0 90.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#11] stanford-crypto-ccm Cycles:10 Average:138.30 Median:136.00 stddev:6.63 (4.9%) stddev-sans-first:6.42 03:24:22 INFO - PROCESS | 1941 | Values: 146.0 133.0 133.0 137.0 135.0 134.0 134.0 152.0 144.0 135.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.90 Median:173.00 stddev:2.18 (1.3%) stddev-sans-first:2.32 03:24:22 INFO - PROCESS | 1941 | Values: 172.0 174.0 169.0 171.0 174.0 175.0 170.0 174.0 170.0 170.0 03:24:22 INFO - PROCESS | 1941 | 03:24:22 INFO - PROCESS | 1941 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.90 Median:68.00 stddev:1.66 (2.4%) stddev-sans-first:1.76 03:24:22 INFO - PROCESS | 1941 | Values: 68.0 68.0 72.0 67.0 69.0 66.0 67.0 68.0 67.0 67.0 03:24:22 INFO - PROCESS | 1941 | -------- Summary: end -------- 03:24:22 INFO - PROCESS | 1941 | 03:24:23 INFO - TEST-INFO | 1941: exit 0 03:24:23 INFO - TEST-OK | kraken | took 65003ms 03:24:23 INFO - SUITE-END | took 1181s 03:24:23 INFO - Completed test suite (00:19:41) 03:24:23 INFO - javascript benchmark 03:24:23 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6344.1664005598805, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2653.9203823885277, 2689.166358428887, 2705.6753189617248, 2706.6481357423545, 2720.0, 4836.758162091899, 4842.29786680931, 4863.148948933936, 4920.8031678732805, 4978.502149785019, 4804.447488538819, 4932.8520144395725, 4960.8015679372875, 5001.0, 5058.69647821131, 4551.840685575998, 4585.105904348653, 4622.352870598119, 4643.628509719214, 4675.812967481296, 375.52309747510907, 4404.97797511012, 4471.530489298626, 4520.412346394964, 4549.454065512126, 4496.325551167319, 4498.392716983198, 4541.091781643651, 4541.659375546814, 4586.862394128181, 4530.433695788027, 4532.4787649420405, 4533.659975501818, 4540.636749060067, 4569.405977222973, 4408.845690400821, 4415.161119387306, 4419.64642828573, 4429.623482004034, 4440.444944381952, 4730.408698912636, 4818.246046988346, 4836.129496690594, 4861.6596838220985, 4903.65674402792, 5226.55574276187, 5242.292290540767, 5247.055530004636, 5251.369835619712, 5298.231756395339, 5313.1764576490705, 5338.359396872362, 5353.491418315254, 5364.007658583136, 5430.728463576806, 4957.182064959277, 4968.925466118048, 4980.651354405157, 4981.103401387785, 4998.90002199954, 5287.101192797234, 5323.3079699639575, 5386.946130538723, 5387.272718182995, 5392.137258038773, 5180.922286165711, 5201.973990130025, 5211.765470553834, 5221.712805795718, 5240.240165176028, 5271.314729085195, 5284.339457567804, 5286.814961476407, 5287.101192797157, 5340.439253878365, 5137.768800403991, 5213.374395072616, 5225.085610018232, 5225.9738701307015, 5261.3686357637325, 5235.0, 5247.317848679647, 5262.421133675292, 5270.7628156733035, 5271.5255626992985, 4420.138073075784, 4422.3808666786035, 4425.22558552252, 4428.490723566831, 4488.0, 3782.3380908340932, 3814.275287695329, 3832.1760821423527, 3851.345271303885, 3875.6899448044087, 4521.0279789845345, 4542.364069030338, 4543.931841022388, 4568.954310456853, 4624.237000894815, 5329.600279979017, 5362.973185134049, 5364.0, 5370.194470829407, 5382.085045542267, 4413.889652758707, 4515.638748900145, 4529.275315949432, 4561.0, 4578.473475550354, 4667.393238878924, 4683.5082316356975, 4726.881827954328, 4735.644826638016, 4782.163121453732, 4830.203016502238, 4892.559669629751, 4896.069746748107, 4897.118518666674, 4962.7022378656675, 5209.895802084013, 5241.842744717665, 5289.7355132242465, 5298.629095963245, 5302.655327403706, 4923.630727695366, 4941.555260026615, 4952.590078850069, 4967.925481117858, 4986.6509344347, 5064.215046667772, 5160.896782064413, 5188.403333616531, 5192.688438693691, 5211.296474975829, 5260.316158899319, 5301.4168441472175, 5308.654937429054, 5332.9733351333, 5385.596080294072, 5197.402298735694, 5207.29701490294, 5216.765245563883, 5228.712420816892, 5281.075811732854, 5086.491350865032, 5105.642605017613, 5106.565941894981, 5205.6356055075785, 5212.869678258074, 5016.774245158904, 5047.772850221675, 5050.0, 5067.670601410897, 5083.161278389172, 5210.869728256824, 5212.0, 5215.582753379645, 5215.739213039409, 5254.7898084076205, 4974.228994505857, 4974.801007959641, 5022.296878437095, 5074.441811400669, 5114.46298138705], "value": 4801.444465255623, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [539.8161427597396, 574.2563380422354, 592.6207227374481, 597.7997370880756, 615.9568830181889, 36705.449418258715, 37493.062673433174, 40414.59585404145, 40446.59553404465, 40586.59413405865, 40249.597504024954, 40811.79594102025, 40829.795851020775, 41024.179516409655, 41115.58884411155, 7942.086660034083, 8016.078151012621, 8054.919450805505, 8056.35549156069, 8082.515049097073, 7831.29518343349, 7940.761777146695, 7963.641636126359, 7967.3626109911065, 7985.520868747864, 7947.443678942476, 7953.801154971115, 7960.283574478296, 7992.080910695287, 8026.799330016738, 7858.921410785876, 7896.289333959942, 7984.081830589498, 7994.040715114194, 8016.959915200387, 7876.094249161362, 7902.20977902211, 7928.484648497829, 7937.72217972374, 7937.920620793833, 38660.22679546393, 39035.60964390348, 39084.218315633814, 39205.0, 39232.60767392318, 2553.872306384692, 2911.1557648281973, 2977.0, 3067.6165479315086, 3109.144985129085, 28001.299967500974, 28345.291367715767, 28517.71482285192, 28654.856725716447, 29256.268593285124, 3371.3257348530146, 3383.813890236036, 3385.509101180315, 3423.8801641942414, 3433.8798142064907, 210819.0, 210848.0, 210913.0, 211270.0, 213129.0, 31991.360172796412, 32482.837585811918, 32485.350292994008, 32495.837520812245, 32551.0, 32487.675123248464, 33331.500027499605, 33463.83268083644, 34968.0, 35176.0, 13443.596692099252, 13498.190108593515, 13512.189268643717, 13527.932360338134, 13566.186028838103, 10320.587176513005, 10383.636572719919, 10396.0, 10403.791924161475, 10430.634927777492, 18299.90850045741, 18344.541386465444, 18426.0, 18512.0, 18547.2380123888, 6754.729810807513, 6766.966165169241, 6824.658767061726, 6905.965470172617, 7173.96413017942, 784.3842583571869, 901.4591245252795, 903.2051794420868, 903.6656437118309, 965.3483898368573, 27876.44247115046, 28445.857770711013, 28545.857270713514, 28607.57088643672, 28748.425031499253, 918.7749001494676, 959.4435227567993, 963.1764841060932, 980.3921568627496, 996.0, 14987.250637468083, 15184.696306073816, 15504.30230639624, 15630.531084067496, 15720.135392553291, 409228.0, 414639.0, 421213.0, 422713.0, 685403.0, 50322.496775032516, 50376.0, 50885.745571272644, 51090.0, 51097.744511277946, 1138.459231864874, 1160.5763896177834, 1189.542026319873, 1197.988020119805, 1201.0271679939276, 27806.165815025583, 28955.27611809637, 29125.85437072801, 29402.852985734935, 29647.0, 43030.35454468123, 43352.0, 43692.0, 43791.90520236892, 43792.0, 276069.0, 276736.0, 277218.0, 278347.0, 278553.0, 25789.097381591553, 25916.09293674712, 26103.216903492925, 26280.21159365222, 26491.0, 42397.36403954005, 42729.14541709086, 43057.784711076245, 43214.0, 43577.346339804295, 36518.0, 36709.63290367062, 36854.8157259212, 36914.077148070435, 37319.27861317858, 35962.46056309105, 36465.81767091148, 36517.634823651424, 36575.0, 36652.0, 35434.29131417305, 35440.46839297464, 35866.28267434689, 36025.81987090048, 36229.0, 32127.67872321247, 33183.668163318056, 33302.66697332996, 33346.33307333888, 33692.0, 25287.11495097663, 25424.618630720182, 25514.74485255198, 25640.0, 25757.689366105424], "value": 17076.258293479386, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [366.9376206044972, 370.6960292560102, 371.30195232962035, 384.2161989541336, 386.9226154769045, 15860.0, 16525.586860328483, 17179.656406871854, 17203.139843007848, 17216.053117078554, 15496.14771187587, 16083.678326433494, 16616.83383166168, 16640.0, 16642.75035874463, 5016.57359124474, 5172.043172013171, 5213.191955246943, 5238.8690282742855, 5241.9213711794355, 3712.2204337089242, 5119.308893299394, 5835.737391817357, 6190.442860142586, 6199.5350348723805, 6108.938910610904, 6126.8468288292925, 6130.203073600425, 6135.9693201534155, 6170.50635949123, 4954.380702412199, 5299.966506531208, 5302.787888484456, 5366.812161574365, 5382.865428364322, 5097.6941383517105, 5226.817061402832, 5348.893022139574, 5358.0, 5365.892682146336, 12064.758704825943, 12070.517179312817, 12280.570180043745, 19551.80448195514, 19704.507387315432, 1768.8142745011846, 1848.7596612440432, 2197.3847322749657, 2226.5769503794227, 2385.2248019393764, 9062.728118156467, 9131.863022054675, 9193.126652967958, 11927.628322742908, 11945.581904633296, 1642.1953242911006, 1679.6472740724462, 1731.3853581978342, 1732.02140790453, 1767.1782621081131, 66286.0, 66859.0, 67638.66180669065, 68172.3182768171, 69304.65347673229, 10062.295639305325, 10087.546060427298, 10091.293609447268, 10225.181985441146, 10314.329568578169, 13687.178769273876, 13752.106113102616, 13803.930980345034, 13816.101953372998, 13960.441582336593, 6569.80290591283, 6789.456843452512, 6797.796066118024, 6821.761238356634, 6924.896126558106, 6237.937620623827, 6248.250209974832, 6327.082573026977, 6354.4281014708895, 6373.298937116913, 4316.028893498938, 4342.5874541918465, 4363.0, 4443.7111587746695, 4502.5047244803045, 1677.6476939842769, 1711.221394265631, 1800.5948661551047, 1854.4158590044092, 1860.5627677495777, 754.6566312327877, 826.5660528222732, 848.2281124176969, 862.1938487514194, 886.2245535156737, 16310.26603802808, 16322.918385407997, 16398.0, 16429.6714065718, 16515.752263716055, 913.1097180249204, 920.802027564077, 940.9529523523796, 944.7260294514651, 946.9384490008127, 9049.411788233743, 9103.317251206186, 9243.445393276425, 9417.38786978858, 9532.428054316762, 357344.0, 364956.0, 365159.0, 366107.0, 370408.0, 61116.0, 72575.27424725791, 73668.63165684137, 75047.62476187584, 76317.23682763102, 823.1562648285436, 857.7769779857282, 862.1120246146479, 864.8702694595735, 883.5670521444574, 14829.480968166063, 14945.925270373578, 14966.92516537454, 15144.505227207572, 15278.541643750705, 31369.21576960503, 33538.49692254667, 34605.30789384249, 36024.81987590045, 37912.43131353087, 51504.0, 51658.74170629123, 51805.7409712949, 51822.74088629533, 51842.74078629583, 6597.901031484627, 6916.377526022682, 7611.847763044819, 7770.3766259075755, 7916.802079948047, 11024.944875275572, 11509.194356395306, 11623.535058597561, 12110.27338359666, 12257.448414821176, 9278.95360523193, 10100.242481813746, 10136.543855526666, 10139.08748212635, 10350.896491034993, 10321.0, 10411.583536658449, 10464.162866970777, 10493.422861742678, 10608.840867387149, 10512.369257844553, 10709.732256693333, 10764.246502744732, 10788.460576971276, 11004.284721493077, 7343.742968996059, 7376.4098872089035, 7538.3969282458365, 7549.773506794805, 7647.235276472308, 7222.133343998754, 8700.477971321741, 9968.750781230527, 10533.36799792015, 10646.467676615983], "value": 8060.966503459932, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1325.8276424064873, 1356.2879488268659, 1426.6647337875597, 1626.3901037111084, 1668.0992264177337, 7009.334113259232, 7721.575313357763, 7729.72945946892, 8270.214329638675, 8288.70989515367, 7894.0, 7958.124606293318, 8029.9197008029905, 8033.839323213532, 8048.678052877878, 2200.251914349125, 2244.2145249162745, 2250.1224522436264, 2251.8536295140843, 2254.199759085526, 2179.3897708641607, 2199.406160336708, 2252.9436764080865, 2257.5372048730055, 2257.9096836126537, 2218.267971569378, 2233.7542870284256, 2234.698315727372, 2236.083205885587, 2263.0495192019393, 2158.2446143849606, 2160.6975023496725, 2172.869627822328, 2175.7497887742798, 2180.509385388291, 2087.3842216546154, 2096.7693553709078, 2109.4620871677776, 2109.504266497372, 2113.7357830271217, 7897.210278972057, 7927.405444591621, 7985.800354991114, 8008.079070906862, 8074.919250807476, 4448.33275008748, 4517.9774101129615, 4548.0903819235955, 4565.885852853672, 4571.817127314936, 2766.667999840012, 2828.9292767680768, 2945.5434407666844, 2962.5111856543645, 2984.5224764037866, 879.612970293069, 910.6858133943845, 930.1489137439303, 936.4849332866896, 941.2093841173447, 10979.451027448675, 11002.33985960845, 11123.833142502868, 11144.60993865219, 11159.38623375722, 4155.2728272552185, 4227.32362821947, 4282.721623094489, 4317.11499142675, 4326.502452217972, 9399.154076133043, 9460.57427415768, 9472.815898012748, 9491.90508094924, 9500.619975201053, 4496.168208881368, 4522.276435770326, 4532.864014079583, 4533.5013148553635, 4539.909201815945, 3495.8601655933476, 4044.4742183515955, 4087.795610219477, 4138.399932009842, 4159.459270294842, 3658.743887927873, 3665.9450108248398, 3697.6117507661847, 3785.488958990556, 3875.496185495924, 1195.964121076369, 1212.775636507249, 1223.9449224784728, 1228.975420491585, 1229.0, 714.7784186901973, 802.0375549340698, 804.9678012879419, 822.0341099208406, 831.4886344897965, 5151.6908985461, 5170.431252562215, 5253.317068781034, 5322.787088516493, 5326.5472434842695, 376.9981150094232, 391.57709673553063, 393.8897108809481, 399.36301598949626, 400.93184158693094, 3298.4392653249006, 3305.140663427478, 3340.88306909257, 3349.949750753741, 3383.796972181677, 9320.30097742672, 9472.431654100776, 9500.714978550655, 9530.332876698703, 9612.375195612263, 9256.0, 9349.0, 9415.952920235492, 9469.10043545862, 9473.857892131624, 7103.822404439827, 7214.96392518034, 7246.130464344207, 7258.782236532912, 7280.526765760209, 5448.046591846491, 5564.051346679835, 5632.2678051853, 5664.37691853904, 5774.133879918046, 9296.95351523238, 9317.208037316634, 9346.672866449642, 9457.668981585612, 9487.241020718187, 8672.913270867211, 9051.592678329624, 9063.728088157366, 9422.811543768948, 9493.762655933657, 6105.114758360101, 6559.27847936717, 6668.333166683293, 6813.931860681329, 6838.658067096725, 7770.145284018867, 7805.297523222937, 7901.802454938673, 7924.960375198318, 7975.082865470546, 6773.0, 6968.860622787414, 7023.578585284899, 7093.787186384417, 7208.603526806076, 6992.916098004817, 7003.369696727319, 7010.948357746379, 7024.121984751906, 7026.156861176692, 6157.4458298753325, 6181.690915454119, 6307.148534947907, 6313.96843015782, 6321.115043893767, 4539.251023581072, 4545.5908968193025, 4579.427571553556, 4606.447226332862, 4613.308003799457, 4647.837325693585, 4660.603848672765, 4716.127516409475, 4730.526947305242, 4752.691075080109], "value": 4081.124656894708, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [283.6822758510467, 290.0789991776111, 297.23313850266317, 297.8808476609356, 304.8948112901051, 4986.9750651246695, 5050.267711181877, 5196.5063318984685, 5200.583953283733, 5266.078436273651, 5107.131787596109, 5117.897642047166, 5128.666636668614, 5141.768620412081, 5148.382194136709, 3951.427043078752, 4014.919701605966, 4033.1328764315667, 4033.556308806036, 4041.8989525261954, 3968.0, 4033.35466325388, 4058.1072164123843, 4059.4316795648633, 4081.4898137732785, 3965.286248475273, 3983.183447393277, 3986.720929534934, 3986.720929534934, 3989.261986532501, 3962.088719594495, 3972.9006774830573, 4012.4583181270445, 4015.638592526687, 4040.616141466556, 3542.663446972559, 3565.750397472178, 3569.5359603251413, 3571.6964058055096, 3576.964230357715, 4863.297845753993, 5020.523050310215, 5020.974895125538, 5022.27177059328, 5096.413912400084, 4532.297493888453, 4579.7710114494475, 4585.197590421662, 4585.358049873021, 4609.446866376056, 5331.333583302087, 5336.119540275849, 5355.651882627617, 5362.0, 5376.569874410077, 3694.205226971089, 3785.1104990327253, 3817.770933743984, 3831.1954489556947, 3856.1323702166787, 5615.831525054255, 5615.943840561583, 5652.18043383707, 5674.773009079673, 5675.432456754333, 3946.052947292629, 3949.328614135604, 3953.7627742335553, 3973.1060511385285, 3986.402039694011, 3562.73522899367, 3849.172427928009, 3983.2830090583393, 3987.7407968481957, 4000.0, 4406.801693923781, 4409.779511024436, 4411.51473337939, 4417.867463976086, 4430.62339701129, 5332.200169974535, 5357.812476563302, 5396.325459317585, 5413.512783849473, 5439.211314359396, 1247.544646204147, 1301.3168086754529, 1330.4545136493991, 1330.9600711978655, 1331.7215473145695, 811.8741595052658, 817.8323443694147, 826.1160558202786, 827.962741676626, 830.2278880641062, 4157.854475093357, 4196.769177695256, 4210.284251677161, 4225.323948168279, 4226.4928208615165, 4865.70805751656, 4874.488178741252, 4875.95124048762, 4883.58489528387, 4890.437599676012, 4180.038591124058, 4243.596858298519, 4261.637760790368, 4271.295236285978, 4284.293091639907, 2540.2887191586387, 2551.757583029609, 2606.9869650651626, 2643.3920198354103, 2643.643108180371, 4552.975580494429, 4566.20091483989, 4573.285018118206, 4583.72497650142, 4639.353029674485, 4939.851804445872, 4973.90052198954, 4974.204127339608, 4976.776045077981, 4991.650584459053, 4392.8139402361185, 4404.2512772828695, 4560.156371071429, 4565.817367305403, 4593.977030114895, 4894.657373983787, 4909.852704418873, 4924.482929292372, 4933.4819843915875, 4941.43173535048, 4810.8797280068275, 4819.26506457682, 4832.468428472936, 4847.200211965127, 4847.3698419205275, 4563.292689633112, 4776.23580227162, 5214.243934629381, 5237.816676416307, 5238.5547228486, 3836.1176929306976, 3837.2133712588293, 3841.1357444574746, 3867.1878905430176, 3869.0714228584375, 5304.761285742074, 5566.051881841323, 5580.609357345109, 5626.606137570495, 5658.321001479849, 5273.630845840754, 5357.544608708304, 5363.463653634605, 5412.648177868426, 5414.214938833926, 5317.282166907418, 5374.4739972213, 5381.13901775714, 5391.838244852661, 5432.511074003359, 5101.51535604117, 5209.76556054986, 5240.868978275574, 5320.813771517978, 5321.122014867658, 5412.350517937873, 5433.9184912225555, 5434.592405569519, 5461.371942226695, 5471.644343117685, 5305.681659100466, 5310.0, 5313.362396512443, 5328.227407025882, 5344.35867695879], "value": 3901.1963595406924, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [615.9774773875367, 637.658852513905, 677.759395414628, 690.0987778669764, 713.7323503686117, 12828.615141545757, 13173.736525269489, 13440.3951822168, 13500.189988600667, 13678.52125175619, 13255.40350684219, 13277.136986095897, 13321.666958326023, 13338.466461341559, 13416.262105584188, 639.7409049335026, 779.8752199648058, 781.5115552779513, 800.5997001499251, 804.1717031457579, 786.7167819584945, 789.9091604465502, 791.6358475101431, 795.3239746215728, 795.7930937956144, 826.1490664615455, 826.9586520673972, 831.55096248026, 834.5743670727911, 836.1387770596265, 816.6855760532178, 826.1614461321764, 828.1097819843662, 828.6354004238116, 829.0548774397192, 602.770947040122, 605.4006533531816, 606.4269265544062, 607.0317843040343, 607.2348840461007, 12857.67855803603, 12892.80660790089, 12947.417366218542, 12951.740965180643, 13019.479220831156, 13426.664333391645, 13604.115732477358, 13737.450501979909, 13771.798902183265, 13908.791368129487, 10149.746256343577, 10190.286679932407, 10233.64182253625, 10444.947775261151, 10494.265401421828, 3373.426517492008, 3428.7428442866635, 3439.570053743282, 3461.13471632092, 3504.7721898076543, 58086.419135808945, 59243.0, 59272.70363648197, 59336.40663593352, 59400.40599593992, 10730.356178629307, 10821.188410869216, 11001.339919604849, 11096.33421994683, 11105.555777768799, 19863.106160222826, 19975.400737977885, 20124.29564965219, 20162.29431969874, 20191.697124543145, 6623.205215374186, 6729.0915726376315, 6730.528862979642, 6792.320767923267, 6795.490338224653, 3597.784132952031, 3618.2401695644207, 3639.3631114554846, 3650.123970247175, 3684.9263014739554, 2819.8590070496803, 2895.1459319500796, 2927.238917881366, 2931.428371467586, 2939.9269266717492, 473.2309996256084, 474.69856641032504, 481.41748484333647, 485.85667228167773, 487.2204472843493, 460.35320374872686, 490.2450226650989, 509.89292248628203, 513.6481510165548, 515.5411683601598, 7789.688412463438, 7837.0, 7870.921290787133, 7878.0, 7966.362690984707, 502.4473079612397, 502.6531693131727, 504.5433882336491, 507.14292845091677, 510.9080365534239, 3581.1047238190454, 3759.6240375962184, 3777.981110094432, 3789.2232092420986, 3848.422736589534, 87393.5630321857, 89329.0, 90183.0, 90472.0, 95502.0, 55601.721991389786, 78859.21140788519, 79764.0, 80578.0, 80621.59689201516, 43226.0, 43300.13399731988, 43775.104404421465, 64897.02654460092, 69844.30155698479, 7258.45561582894, 7285.599292038989, 7303.817404564928, 7544.622768861425, 7621.352185064332, 42330.0, 43225.56774432216, 43380.34929475997, 44181.33727994147, 44313.33529997117, 53794.46205537894, 60804.69597651983, 61296.38703612907, 61927.233825573, 62250.68874655598, 9240.537973101184, 9395.342326037111, 9507.477088760184, 9525.904740952501, 9754.219662427131, 10287.33132346425, 10309.536070876979, 10353.896461035594, 10360.948195258976, 10889.183311251847, 9934.105930466003, 10007.54966026516, 10063.547140378554, 10109.898901011189, 10215.795684086424, 9477.0, 9517.619295228113, 9563.330566860253, 9643.180329672057, 9661.178799802095, 9831.164351030242, 9998.350107243006, 10037.89962100399, 10130.493475326057, 10408.947955260175, 8697.21725044749, 8757.649694012423, 8810.427322224035, 8877.511736854534, 8914.73255802327, 8643.697470588499, 8796.0, 8801.779955501164, 9190.080991900757, 9190.494522801042], "value": 6195.425392316604, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1593.1000000000004, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 113.0, 114.0, 113.0, 113.0, 113.0, 112.0, 112.0, 114.0, 112.0], "value": 113.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 133.0, 157.0, 190.0, 137.0, 159.0, 162.0, 132.0, 191.0, 142.0], "value": 156.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 168.0, 177.0, 164.0, 164.0, 163.0, 166.0, 164.0, 163.0, 161.0], "value": 165.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 77.0, 76.0, 170.0, 77.0, 75.0, 74.0, 76.0, 160.0, 77.0], "value": 94.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 86.0, 151.0, 87.0, 86.0, 87.0, 136.0, 87.0, 86.0, 130.0], "value": 102.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 118.0, 117.0, 117.0, 118.0, 117.0, 118.0, 118.0], "value": 117.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 148.0, 147.0, 147.0, 148.0, 148.0, 148.0, 181.0, 147.0, 149.0], "value": 151.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 95.0, 95.0, 95.0, 97.0, 95.0, 96.0, 95.0, 96.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 64.0, 63.0, 64.0, 63.0, 64.0, 64.0, 63.0, 66.0, 75.0], "value": 64.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 65.0, 66.0, 65.0, 65.0, 65.0, 65.0, 68.0, 66.0, 65.0], "value": 65.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 84.0, 84.0, 85.0, 88.0, 85.0, 84.0, 86.0, 113.0, 90.0], "value": 88.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 133.0, 133.0, 137.0, 135.0, 134.0, 134.0, 152.0, 144.0, 135.0], "value": 138.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [172.0, 174.0, 169.0, 171.0, 174.0, 175.0, 170.0, 174.0, 170.0, 170.0], "value": 171.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 72.0, 67.0, 69.0, 66.0, 67.0, 68.0, 67.0, 67.0], "value": 67.9, "unit": "score"}]}]} 03:24:23 INFO - Return code: 0 03:24:23 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:24:23 ERROR - # TBPL SUCCESS # 03:24:23 INFO - Running post-action listener: _resource_record_post_action 03:24:23 INFO - ##### 03:24:23 INFO - ##### Finished run-tests step (success) 03:24:23 INFO - ##### 03:24:23 INFO - Running post-run listener: _resource_record_post_run 03:24:23 INFO - Total resource usage - Wall time: 1199s; CPU: 14.0%; Read bytes: 4096; Write bytes: 542535680; Read time: 16; Write time: 447784 03:24:23 INFO - TinderboxPrint: CPU usage
13.5% 03:24:23 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 03:24:23 INFO - TinderboxPrint: I/O write bytes / time
542,535,680 / 447,784 03:24:23 INFO - TinderboxPrint: CPU idle
8,269.9 (86.5%) 03:24:23 INFO - TinderboxPrint: CPU user
1,237.3 (12.9%) 03:24:23 INFO - TinderboxPrint: Swap in / out
0 / 0 03:24:23 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 245579776; Read time: 0; Write time: 277900 03:24:23 INFO - run-tests - Wall time: 1183s; CPU: 14.0%; Read bytes: 4096; Write bytes: 296955904; Read time: 16; Write time: 169884 03:24:24 INFO - Running post-run listener: _upload_blobber_files 03:24:24 INFO - Blob upload gear active. 03:24:24 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:24:24 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 03:24:24 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-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:24:24 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-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:24:24 INFO - (blobuploader) - INFO - Open directory for files ... 03:24:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 03:24:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:24:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:24:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 03:24:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:24:25 INFO - (blobuploader) - INFO - Done attempting. 03:24:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:24:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:24:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:24:29 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:24:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:24:29 INFO - (blobuploader) - INFO - Done attempting. 03:24:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 03:24:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:24:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:24:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 03:24:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:24:29 INFO - (blobuploader) - INFO - Done attempting. 03:24:29 INFO - (blobuploader) - INFO - Iteration through files over. 03:24:29 INFO - Return code: 0 03:24:29 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:24:29 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:24:29 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/fd0a6c9397632591b5864e38566e9a6f03bba62d66618cc66128c19db8fbb8f8da9c9c9fb76ee7704caa4832d43e8a7bdf16c2d1d3eb1264c249f386e9f64327", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/bb7e3508c469885b43a3bef1247b75fbcc3d8eebed7a7d06c847434e2c7eb1355f28958199c6dbe17db720cf6641eae1993d1412db31ea7464b30bfacc01fae0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7a4551dea3d570685175ca9bb65f650d4e4cd846c440e6ad8a9a181de1c483efdb69132ac2fbea875003bcc9ad30ca49699951befe6e8c8fdf62876e534fc4bf"} 03:24:29 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:24:29 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:24:29 INFO - Contents: 03:24:29 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/fd0a6c9397632591b5864e38566e9a6f03bba62d66618cc66128c19db8fbb8f8da9c9c9fb76ee7704caa4832d43e8a7bdf16c2d1d3eb1264c249f386e9f64327", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/bb7e3508c469885b43a3bef1247b75fbcc3d8eebed7a7d06c847434e2c7eb1355f28958199c6dbe17db720cf6641eae1993d1412db31ea7464b30bfacc01fae0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7a4551dea3d570685175ca9bb65f650d4e4cd846c440e6ad8a9a181de1c483efdb69132ac2fbea875003bcc9ad30ca49699951befe6e8c8fdf62876e534fc4bf"} 03:24:29 INFO - Running post-run listener: copy_logs_to_upload_dir 03:24:29 INFO - Copying logs to upload dir... 03:24:29 INFO - mkdir: /builds/slave/test/build/upload/logs 03:24:29 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1255.990043 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 56 secs) (at 2016-06-16 03:24:29.076733) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-16 03:24:29.080248) ========= 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=836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461 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-Non-PGO/sha512/fd0a6c9397632591b5864e38566e9a6f03bba62d66618cc66128c19db8fbb8f8da9c9c9fb76ee7704caa4832d43e8a7bdf16c2d1d3eb1264c249f386e9f64327", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/bb7e3508c469885b43a3bef1247b75fbcc3d8eebed7a7d06c847434e2c7eb1355f28958199c6dbe17db720cf6641eae1993d1412db31ea7464b30bfacc01fae0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7a4551dea3d570685175ca9bb65f650d4e4cd846c440e6ad8a9a181de1c483efdb69132ac2fbea875003bcc9ad30ca49699951befe6e8c8fdf62876e534fc4bf"} build_url:https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011364 build_url: 'https://queue.taskcluster.net/v1/task/JaqKuowaSxagxjXatsmacA/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-Non-PGO/sha512/fd0a6c9397632591b5864e38566e9a6f03bba62d66618cc66128c19db8fbb8f8da9c9c9fb76ee7704caa4832d43e8a7bdf16c2d1d3eb1264c249f386e9f64327", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/bb7e3508c469885b43a3bef1247b75fbcc3d8eebed7a7d06c847434e2c7eb1355f28958199c6dbe17db720cf6641eae1993d1412db31ea7464b30bfacc01fae0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7a4551dea3d570685175ca9bb65f650d4e4cd846c440e6ad8a9a181de1c483efdb69132ac2fbea875003bcc9ad30ca49699951befe6e8c8fdf62876e534fc4bf"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-16 03:24:29.110126) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 03:24:29.110659) ========= 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=836cfdc75598d54cb747368e000001a9-1466067382.672114-851745461 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004426 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 03:24:29.196561) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-16 03:24:29.196960) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-16 03:24:29.197275) ========= ========= Total master_lag: 0.17 =========