builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-033 starttime: 1466533084.51 results: success (0) buildid: 20160621083052 builduid: 52f218857c63453c9ab390f632936197 revision: ecd3562339dcd51a604e82efbcb347de8b823aee ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.514124) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.514795) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.515104) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.530745) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.531141) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-21 11:18:04-- 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% 24.4M=0s 2016-06-21 11:18:04 (24.4 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.358863 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.904216) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.904574) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016156 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.954359) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:04.954721) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev ecd3562339dcd51a604e82efbcb347de8b823aee --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 ecd3562339dcd51a604e82efbcb347de8b823aee --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=edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-21 11:18:05,082 truncating revision to first 12 chars 2016-06-21 11:18:05,082 Setting DEBUG logging. 2016-06-21 11:18:05,082 attempt 1/10 2016-06-21 11:18:05,082 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ecd3562339dc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-21 11:18:05,427 unpacking tar archive at: fx-team-ecd3562339dc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.696557 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:05.664632) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:05.664941) ========= script_repo_revision: ecd3562339dcd51a604e82efbcb347de8b823aee ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:05.665373) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:05.665644) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-21 11:18:05.674058) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 23 mins, 53 secs) (at 2016-06-21 11:18:05.674350) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:18:05 INFO - MultiFileLogger online at 20160621 11:18:05 in /builds/slave/test 11:18:05 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 11:18:05 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:18:05 INFO - {'append_to_log': False, 11:18:05 INFO - 'base_work_dir': '/builds/slave/test', 11:18:05 INFO - 'blob_upload_branch': 'Fx-Team', 11:18:05 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:18:05 INFO - 'branch': 'Fx-Team', 11:18:05 INFO - 'buildbot_json_path': 'buildprops.json', 11:18:05 INFO - 'config_files': ('talos/linux_config.py',), 11:18:05 INFO - 'default_actions': ('clobber', 11:18:05 INFO - 'read-buildbot-config', 11:18:05 INFO - 'download-and-extract', 11:18:05 INFO - 'populate-webroot', 11:18:05 INFO - 'create-virtualenv', 11:18:05 INFO - 'install', 11:18:05 INFO - 'run-tests'), 11:18:05 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:18:05 INFO - 'download_minidump_stackwalk': True, 11:18:05 INFO - 'download_symbols': 'ondemand', 11:18:05 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:18:05 INFO - 'tooltool.py': '/tools/tooltool.py', 11:18:05 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:18:05 INFO - '/tools/misc-python/virtualenv.py')}, 11:18:05 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:18:05 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:18:05 INFO - 'installer_path': 'installer.exe', 11:18:05 INFO - 'log_level': 'info', 11:18:05 INFO - 'log_name': 'talos', 11:18:05 INFO - 'log_to_console': True, 11:18:05 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:18:05 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:18:05 INFO - 'opt_config_files': (), 11:18:05 INFO - 'pip_index': False, 11:18:05 INFO - 'sps_profile': False, 11:18:05 INFO - 'sps_profile_interval': 0, 11:18:05 INFO - 'suite': 'dromaeojs', 11:18:05 INFO - 'system_bits': '32', 11:18:05 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:18:05 INFO - 'title': 'talos-linux64-ix-033', 11:18:05 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:18:05 INFO - 'use_talos_json': True, 11:18:05 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:18:05 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:18:05 INFO - 'work_dir': 'build'} 11:18:05 INFO - ##### 11:18:05 INFO - ##### Running clobber step. 11:18:05 INFO - ##### 11:18:05 INFO - Running pre-action listener: _resource_record_pre_action 11:18:05 INFO - Running main action method: clobber 11:18:05 INFO - rmtree: /builds/slave/test/build 11:18:05 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:18:06 INFO - Running post-action listener: _resource_record_post_action 11:18:06 INFO - ##### 11:18:06 INFO - ##### Finished clobber step (success) 11:18:06 INFO - ##### 11:18:06 INFO - ##### 11:18:06 INFO - ##### Running read-buildbot-config step. 11:18:06 INFO - ##### 11:18:06 INFO - Running pre-action listener: _resource_record_pre_action 11:18:06 INFO - Running main action method: read_buildbot_config 11:18:06 INFO - Using buildbot properties: 11:18:06 INFO - { 11:18:06 INFO - "project": "", 11:18:06 INFO - "product": "firefox", 11:18:06 INFO - "script_repo_revision": "production", 11:18:06 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 11:18:06 INFO - "repository": "", 11:18:06 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 11:18:06 INFO - "buildid": "20160621083052", 11:18:06 INFO - "pgo_build": "True", 11:18:06 INFO - "basedir": "/builds/slave/test", 11:18:06 INFO - "buildnumber": 816, 11:18:06 INFO - "slavename": "talos-linux64-ix-033", 11:18:06 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 11:18:06 INFO - "platform": "ubuntu64_hw", 11:18:06 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:18:06 INFO - "branch": "fx-team", 11:18:06 INFO - "repo_path": "integration/fx-team", 11:18:06 INFO - "revision": "ecd3562339dcd51a604e82efbcb347de8b823aee", 11:18:06 INFO - "stage_platform": "linux64-pgo", 11:18:06 INFO - "builduid": "52f218857c63453c9ab390f632936197", 11:18:06 INFO - "slavebuilddir": "test" 11:18:06 INFO - } 11:18:06 INFO - Found installer url https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 11:18:06 INFO - Running post-action listener: _resource_record_post_action 11:18:06 INFO - ##### 11:18:06 INFO - ##### Finished read-buildbot-config step (success) 11:18:06 INFO - ##### 11:18:06 INFO - ##### 11:18:06 INFO - ##### Running download-and-extract step. 11:18:06 INFO - ##### 11:18:06 INFO - Running pre-action listener: _resource_record_pre_action 11:18:06 INFO - Running main action method: download_and_extract 11:18:06 INFO - mkdir: /builds/slave/test/build/tests 11:18:06 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')]} 11:18:06 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:18:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:18:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:18:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:18:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:18:07 INFO - Downloaded 1361 bytes. 11:18:07 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:18:07 INFO - Using the following test package requirements: 11:18:07 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:18:07 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:18:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:18:07 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:18:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:18:07 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:18:07 INFO - u'jsshell-linux-x86_64.zip'], 11:18:07 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:18:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:18:07 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:18:07 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:18:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:18:07 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:18:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:18:07 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:18:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:18:07 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:18:07 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:18:07 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:18: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')]} 11:18:07 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:18:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:18:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:18:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:18:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:18:37 INFO - Downloaded 24225158 bytes. 11:18:37 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'] 11:18:37 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 11:18:39 INFO - Return code: 0 11:18:39 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 11:18:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:18:39 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:18:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:18:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:18:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:18:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:20:31 INFO - Downloaded 24225158 bytes. 11:20:31 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'] 11:20:31 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 11:20:33 INFO - Return code: 0 11:20:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:20:33 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:20:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:20:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:20:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:20:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:20:34 INFO - Downloaded 14405384 bytes. 11:20:34 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'] 11:20:34 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 11:20:34 INFO - Return code: 0 11:20: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')]} 11:20:34 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:20:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:20:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:20:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:20:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:21:30 INFO - Downloaded 60130839 bytes. 11:21:30 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:21:30 INFO - mkdir: /builds/slave/test/properties 11:21:30 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:21:30 INFO - Writing to file /builds/slave/test/properties/build_url 11:21:30 INFO - Contents: 11:21:30 INFO - build_url:https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:21:31 INFO - Running post-action listener: _resource_record_post_action 11:21:31 INFO - Running post-action listener: set_extra_try_arguments 11:21:31 INFO - ##### 11:21:31 INFO - ##### Finished download-and-extract step (success) 11:21:31 INFO - ##### 11:21:31 INFO - ##### 11:21:31 INFO - ##### Running populate-webroot step. 11:21:31 INFO - ##### 11:21:31 INFO - Running pre-action listener: _resource_record_pre_action 11:21:31 INFO - Running main action method: populate_webroot 11:21:31 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:21:31 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:21:31 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:21:31 INFO - '--tppagecycles', 11:21:31 INFO - '7'], 11:21:31 INFO - 'tests': ['tsvgm']}}, 11:21:31 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:21:31 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:21:31 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:21:31 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:21:31 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:31 INFO - 'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:21:31 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:21:31 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:31 INFO - 'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['damp', 'tps']}, 11:21:31 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:31 INFO - 'tests': ['damp', 'tps']}, 11:21:31 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['dromaeo_dom']}, 11:21:31 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:21:31 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['basic_compositor_video']}, 11:21:31 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 11:21:31 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['a11yr', 11:21:31 INFO - 'ts_paint', 11:21:31 INFO - 'tpaint', 11:21:31 INFO - 'sessionrestore', 11:21:31 INFO - 'sessionrestore_no_auto_restore', 11:21:31 INFO - 'tabpaint']}, 11:21:31 INFO - 'other-e10s': {'tests': ['a11yr', 11:21:31 INFO - 'ts_paint', 11:21:31 INFO - 'tpaint', 11:21:31 INFO - 'sessionrestore', 11:21:31 INFO - 'sessionrestore_no_auto_restore', 11:21:31 INFO - 'tabpaint']}, 11:21:31 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:21:31 INFO - 'ts_paint', 11:21:31 INFO - 'tpaint', 11:21:31 INFO - 'sessionrestore', 11:21:31 INFO - 'sessionrestore_no_auto_restore', 11:21:31 INFO - 'tabpaint']}, 11:21:31 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:21:31 INFO - 'ts_paint', 11:21:31 INFO - 'tpaint', 11:21:31 INFO - 'sessionrestore', 11:21:31 INFO - 'sessionrestore_no_auto_restore', 11:21:31 INFO - 'tabpaint']}, 11:21:31 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['a11yr', 11:21:31 INFO - 'ts_paint', 11:21:31 INFO - 'tpaint', 11:21:31 INFO - 'sessionrestore', 11:21:31 INFO - 'sessionrestore_no_auto_restore', 11:21:31 INFO - 'tabpaint']}, 11:21:31 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['a11yr', 11:21:31 INFO - 'ts_paint', 11:21:31 INFO - 'tpaint', 11:21:31 INFO - 'sessionrestore', 11:21:31 INFO - 'sessionrestore_no_auto_restore', 11:21:31 INFO - 'tabpaint']}, 11:21:31 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['tsvgx', 11:21:31 INFO - 'tsvgr_opacity', 11:21:31 INFO - 'tart', 11:21:31 INFO - 'tscrollx', 11:21:31 INFO - 'cart']}, 11:21:31 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:21:31 INFO - 'tsvgr_opacity', 11:21:31 INFO - 'tart', 11:21:31 INFO - 'tscrollx', 11:21:31 INFO - 'cart']}, 11:21:31 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:31 INFO - 'talos_options': ['--disable-e10s'], 11:21:31 INFO - 'tests': ['tp5o']}, 11:21:31 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:31 INFO - 'tests': ['tp5o']}, 11:21:31 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:31 INFO - 'talos_options': ['--disable-e10s', 11:21:31 INFO - '--xperf_path', 11:21:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:21:31 INFO - 'tests': ['tp5n']}, 11:21:31 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:31 INFO - 'talos_options': ['--xperf_path', 11:21:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:21:31 INFO - 'tests': ['tp5n']}}, 11:21:31 INFO - 'talos.zip': {'path': '', 11:21:31 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:21:31 INFO - Running post-action listener: _resource_record_post_action 11:21:31 INFO - ##### 11:21:31 INFO - ##### Finished populate-webroot step (success) 11:21:31 INFO - ##### 11:21:31 INFO - ##### 11:21:31 INFO - ##### Running create-virtualenv step. 11:21:31 INFO - ##### 11:21:31 INFO - Running pre-action listener: _resource_record_pre_action 11:21:31 INFO - Running main action method: create_virtualenv 11:21:31 INFO - Creating virtualenv /builds/slave/test/build/venv 11:21:31 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 11:21:31 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:21:31 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:21:31 INFO - Using real prefix '/usr' 11:21:31 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:21:31 INFO - Installing distribute.............................................................................................................................................................................................done. 11:21:33 INFO - Installing pip.................done. 11:21:33 INFO - Return code: 0 11:21:33 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:21:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:33 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:33 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 11:21:33 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 11:21:33 INFO - Using env: {'DISPLAY': ':0', 11:21:33 INFO - 'HOME': '/home/cltbld', 11:21:33 INFO - 'LANG': 'en_US.UTF-8', 11:21:33 INFO - 'LANGUAGE': 'en_US:en', 11:21:33 INFO - 'LOGNAME': 'cltbld', 11:21:33 INFO - 'MAIL': '/var/mail/cltbld', 11:21:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:33 INFO - 'MOZ_NO_REMOTE': '1', 11:21:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:33 INFO - 'NO_EM_RESTART': '1', 11:21:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:33 INFO - 'PWD': '/builds/slave/test', 11:21:33 INFO - 'SHELL': '/bin/bash', 11:21:33 INFO - 'SHLVL': '1', 11:21:33 INFO - 'TERM': 'linux', 11:21:33 INFO - 'TMOUT': '86400', 11:21:33 INFO - 'USER': 'cltbld', 11:21:33 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:33 INFO - '_': '/tools/buildbot/bin/python'} 11:21:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:33 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 11:21:33 INFO - Cleaning up... 11:21:34 INFO - Return code: 0 11:21:34 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:21: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')]} 11:21:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21: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')]} 11:21:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:34 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:34 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 11:21:34 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 11:21:34 INFO - Using env: {'DISPLAY': ':0', 11:21:34 INFO - 'HOME': '/home/cltbld', 11:21:34 INFO - 'LANG': 'en_US.UTF-8', 11:21:34 INFO - 'LANGUAGE': 'en_US:en', 11:21:34 INFO - 'LOGNAME': 'cltbld', 11:21:34 INFO - 'MAIL': '/var/mail/cltbld', 11:21:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:34 INFO - 'MOZ_NO_REMOTE': '1', 11:21:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:34 INFO - 'NO_EM_RESTART': '1', 11:21:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:34 INFO - 'PWD': '/builds/slave/test', 11:21:34 INFO - 'SHELL': '/bin/bash', 11:21:34 INFO - 'SHLVL': '1', 11:21:34 INFO - 'TERM': 'linux', 11:21:34 INFO - 'TMOUT': '86400', 11:21:34 INFO - 'USER': 'cltbld', 11:21:34 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:34 INFO - '_': '/tools/buildbot/bin/python'} 11:21:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:34 INFO - Downloading/unpacking psutil>=3.1.1 11:21:34 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 11:21:34 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 11:21:34 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 11:21:34 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 11:21:34 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 11:21:34 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 11:21:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:21:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:21:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:21:36 INFO - Installing collected packages: psutil 11:21:36 INFO - Running setup.py install for psutil 11:21:36 INFO - building 'psutil._psutil_linux' extension 11:21:36 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 11:21:36 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 11:21:36 INFO - building 'psutil._psutil_posix' extension 11:21:36 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 11:21:36 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 11:21:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:21:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:21:36 INFO - Successfully installed psutil 11:21:36 INFO - Cleaning up... 11:21:36 INFO - Return code: 0 11:21:36 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:21:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:36 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:36 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 11:21:36 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 11:21:36 INFO - Using env: {'DISPLAY': ':0', 11:21:36 INFO - 'HOME': '/home/cltbld', 11:21:36 INFO - 'LANG': 'en_US.UTF-8', 11:21:36 INFO - 'LANGUAGE': 'en_US:en', 11:21:36 INFO - 'LOGNAME': 'cltbld', 11:21:36 INFO - 'MAIL': '/var/mail/cltbld', 11:21:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:36 INFO - 'MOZ_NO_REMOTE': '1', 11:21:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:36 INFO - 'NO_EM_RESTART': '1', 11:21:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:36 INFO - 'PWD': '/builds/slave/test', 11:21:36 INFO - 'SHELL': '/bin/bash', 11:21:36 INFO - 'SHLVL': '1', 11:21:36 INFO - 'TERM': 'linux', 11:21:36 INFO - 'TMOUT': '86400', 11:21:36 INFO - 'USER': 'cltbld', 11:21:36 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:36 INFO - '_': '/tools/buildbot/bin/python'} 11:21:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:36 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:21:36 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 11:21:36 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 11:21:36 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 11:21:36 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 11:21:36 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 11:21:36 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 11:21:38 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:21:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:21:38 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:21:38 INFO - Installing collected packages: mozsystemmonitor 11:21:38 INFO - Running setup.py install for mozsystemmonitor 11:21:39 INFO - Successfully installed mozsystemmonitor 11:21:39 INFO - Cleaning up... 11:21:39 INFO - Return code: 0 11:21:39 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:21:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:39 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:39 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 11:21:39 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 11:21:39 INFO - Using env: {'DISPLAY': ':0', 11:21:39 INFO - 'HOME': '/home/cltbld', 11:21:39 INFO - 'LANG': 'en_US.UTF-8', 11:21:39 INFO - 'LANGUAGE': 'en_US:en', 11:21:39 INFO - 'LOGNAME': 'cltbld', 11:21:39 INFO - 'MAIL': '/var/mail/cltbld', 11:21:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:39 INFO - 'MOZ_NO_REMOTE': '1', 11:21:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:39 INFO - 'NO_EM_RESTART': '1', 11:21:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:39 INFO - 'PWD': '/builds/slave/test', 11:21:39 INFO - 'SHELL': '/bin/bash', 11:21:39 INFO - 'SHLVL': '1', 11:21:39 INFO - 'TERM': 'linux', 11:21:39 INFO - 'TMOUT': '86400', 11:21:39 INFO - 'USER': 'cltbld', 11:21:39 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:39 INFO - '_': '/tools/buildbot/bin/python'} 11:21:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:39 INFO - Downloading/unpacking jsonschema==2.5.1 11:21:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:41 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:21:41 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:21:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:41 INFO - Downloading functools32-3.2.3-2.tar.gz 11:21:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:21:41 INFO - warning: no files found matching '*.txt' 11:21:41 INFO - no previously-included directories found matching 'build' 11:21:41 INFO - no previously-included directories found matching 'dist' 11:21:41 INFO - no previously-included directories found matching '.git*' 11:21:41 INFO - Installing collected packages: jsonschema, functools32 11:21:41 INFO - Running setup.py install for functools32 11:21:41 INFO - warning: no files found matching '*.txt' 11:21:41 INFO - no previously-included directories found matching 'build' 11:21:41 INFO - no previously-included directories found matching 'dist' 11:21:41 INFO - no previously-included directories found matching '.git*' 11:21:41 INFO - Successfully installed jsonschema functools32 11:21:41 INFO - Cleaning up... 11:21:41 INFO - Return code: 0 11:21:41 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:21:41 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')]} 11:21:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:41 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')]} 11:21:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:41 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:41 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 11:21:41 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 11:21:41 INFO - Using env: {'DISPLAY': ':0', 11:21:41 INFO - 'HOME': '/home/cltbld', 11:21:41 INFO - 'LANG': 'en_US.UTF-8', 11:21:41 INFO - 'LANGUAGE': 'en_US:en', 11:21:41 INFO - 'LOGNAME': 'cltbld', 11:21:41 INFO - 'MAIL': '/var/mail/cltbld', 11:21:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:41 INFO - 'MOZ_NO_REMOTE': '1', 11:21:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:41 INFO - 'NO_EM_RESTART': '1', 11:21:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:41 INFO - 'PWD': '/builds/slave/test', 11:21:41 INFO - 'SHELL': '/bin/bash', 11:21:41 INFO - 'SHLVL': '1', 11:21:41 INFO - 'TERM': 'linux', 11:21:41 INFO - 'TMOUT': '86400', 11:21:41 INFO - 'USER': 'cltbld', 11:21:41 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:41 INFO - '_': '/tools/buildbot/bin/python'} 11:21:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:41 INFO - Downloading/unpacking blobuploader==1.2.4 11:21:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:43 INFO - Downloading blobuploader-1.2.4.tar.gz 11:21:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:21:43 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:21:43 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 11:21:43 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 11:21:43 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 11:21:43 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 11:21:43 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 11:21:43 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 11:21:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:21:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:21:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:44 INFO - Downloading docopt-0.6.1.tar.gz 11:21:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:21:44 INFO - Installing collected packages: blobuploader, requests, docopt 11:21:44 INFO - Running setup.py install for blobuploader 11:21:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:21:44 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:21:44 INFO - Running setup.py install for requests 11:21:45 INFO - Running setup.py install for docopt 11:21:45 INFO - Successfully installed blobuploader requests docopt 11:21:45 INFO - Cleaning up... 11:21:45 INFO - Return code: 0 11:21:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:21: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')]} 11:21:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21: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')]} 11:21:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:45 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:45 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 11:21:45 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 11:21:45 INFO - Using env: {'DISPLAY': ':0', 11:21:45 INFO - 'HOME': '/home/cltbld', 11:21:45 INFO - 'LANG': 'en_US.UTF-8', 11:21:45 INFO - 'LANGUAGE': 'en_US:en', 11:21:45 INFO - 'LOGNAME': 'cltbld', 11:21:45 INFO - 'MAIL': '/var/mail/cltbld', 11:21:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:45 INFO - 'MOZ_NO_REMOTE': '1', 11:21:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:45 INFO - 'NO_EM_RESTART': '1', 11:21:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:45 INFO - 'PWD': '/builds/slave/test', 11:21:45 INFO - 'SHELL': '/bin/bash', 11:21:45 INFO - 'SHLVL': '1', 11:21:45 INFO - 'TERM': 'linux', 11:21:45 INFO - 'TMOUT': '86400', 11:21:45 INFO - 'USER': 'cltbld', 11:21:45 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:45 INFO - '_': '/tools/buildbot/bin/python'} 11:21:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:21:45 INFO - Running setup.py (path:/tmp/pip-sP301Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:21:45 INFO - Running setup.py (path:/tmp/pip-d15bAR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:21:45 INFO - Running setup.py (path:/tmp/pip-qDHDmC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:21:45 INFO - Running setup.py (path:/tmp/pip-laFwpU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:21:45 INFO - Running setup.py (path:/tmp/pip-TVKtXU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:21:45 INFO - Running setup.py (path:/tmp/pip-Tn3ctx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:21:45 INFO - Running setup.py (path:/tmp/pip-uAOZJ_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:21:45 INFO - Running setup.py (path:/tmp/pip-CDtaZR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:21:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:21:45 INFO - Running setup.py (path:/tmp/pip-5BzwNr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:21:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:21:46 INFO - Running setup.py (path:/tmp/pip-1PGr_K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:21:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:21:46 INFO - Running setup.py (path:/tmp/pip-FdpEvF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:21:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:21:46 INFO - Running setup.py (path:/tmp/pip-sHRKVQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:21:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:21:46 INFO - Running setup.py (path:/tmp/pip-Qaa8WW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:21:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:21:46 INFO - Running setup.py (path:/tmp/pip-fSzUfI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:21:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:21:46 INFO - Running setup.py (path:/tmp/pip-j0Z2FB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:21:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:21:46 INFO - Running setup.py (path:/tmp/pip-cI5NdU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:21:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:21:46 INFO - Running setup.py (path:/tmp/pip-sD1tMi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:21:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:21:46 INFO - Running setup.py install for manifestparser 11:21:46 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:21:46 INFO - Running setup.py install for mozcrash 11:21:46 INFO - Running setup.py install for mozdebug 11:21:46 INFO - Running setup.py install for mozdevice 11:21:47 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Running setup.py install for mozfile 11:21:47 INFO - Running setup.py install for mozhttpd 11:21:47 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Running setup.py install for mozinfo 11:21:47 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Running setup.py install for mozInstall 11:21:47 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Running setup.py install for mozleak 11:21:47 INFO - Running setup.py install for mozlog 11:21:47 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Running setup.py install for moznetwork 11:21:47 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Running setup.py install for mozprocess 11:21:47 INFO - Running setup.py install for mozprofile 11:21:47 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:21:47 INFO - Running setup.py install for mozrunner 11:21:48 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:21:48 INFO - Running setup.py install for mozscreenshot 11:21:48 INFO - Running setup.py install for moztest 11:21:48 INFO - Running setup.py install for mozversion 11:21:48 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:21:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:21:48 INFO - Cleaning up... 11:21:48 INFO - Return code: 0 11:21:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:21:48 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')]} 11:21:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:48 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')]} 11:21:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:48 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:48 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 11:21:48 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 11:21:48 INFO - Using env: {'DISPLAY': ':0', 11:21:48 INFO - 'HOME': '/home/cltbld', 11:21:48 INFO - 'LANG': 'en_US.UTF-8', 11:21:48 INFO - 'LANGUAGE': 'en_US:en', 11:21:48 INFO - 'LOGNAME': 'cltbld', 11:21:48 INFO - 'MAIL': '/var/mail/cltbld', 11:21:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:48 INFO - 'MOZ_NO_REMOTE': '1', 11:21:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:48 INFO - 'NO_EM_RESTART': '1', 11:21:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:48 INFO - 'PWD': '/builds/slave/test', 11:21:48 INFO - 'SHELL': '/bin/bash', 11:21:48 INFO - 'SHLVL': '1', 11:21:48 INFO - 'TERM': 'linux', 11:21:48 INFO - 'TMOUT': '86400', 11:21:48 INFO - 'USER': 'cltbld', 11:21:48 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:48 INFO - '_': '/tools/buildbot/bin/python'} 11:21:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:21:48 INFO - Running setup.py (path:/tmp/pip-F88Eds-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:21:48 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)) 11:21:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:21:48 INFO - Running setup.py (path:/tmp/pip-oXBOaq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:21:48 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)) 11:21:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:21:48 INFO - Running setup.py (path:/tmp/pip-o3KNiC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:21:48 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)) 11:21:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:21:48 INFO - Running setup.py (path:/tmp/pip-_hf40F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:21:48 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)) 11:21:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:21:48 INFO - Running setup.py (path:/tmp/pip-ViPWu_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:21:48 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)) 11:21:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:21:48 INFO - Running setup.py (path:/tmp/pip-6En8uA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:21:49 INFO - Running setup.py (path:/tmp/pip-ErFUOG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:21:49 INFO - Running setup.py (path:/tmp/pip-wJfQCX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:21:49 INFO - Running setup.py (path:/tmp/pip-S9arB8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:21:49 INFO - Running setup.py (path:/tmp/pip-GfsaOE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:21:49 INFO - Running setup.py (path:/tmp/pip-7UObmv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:21:49 INFO - Running setup.py (path:/tmp/pip-7Hwk1g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:21:49 INFO - Running setup.py (path:/tmp/pip-mHRNJ9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:21:49 INFO - Running setup.py (path:/tmp/pip-xqFKvK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:21:49 INFO - Running setup.py (path:/tmp/pip-0XrX6T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:21:49 INFO - Running setup.py (path:/tmp/pip-85a3hS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:21:49 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)) 11:21:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:21:49 INFO - Running setup.py (path:/tmp/pip-z9lz8h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:21:49 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)) 11:21:49 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)) 11:21:49 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)) 11:21:49 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)) 11:21:49 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)) 11:21:49 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)) 11:21:49 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:21:49 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 11:21:49 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 11:21:49 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 11:21:49 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 11:21:49 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 11:21:49 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 11:21:51 INFO - Downloading blessings-1.6.tar.gz 11:21:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:21:51 INFO - Installing collected packages: blessings 11:21:51 INFO - Running setup.py install for blessings 11:21:51 INFO - Successfully installed blessings 11:21:51 INFO - Cleaning up... 11:21:52 INFO - Return code: 0 11:21:52 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:21:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:21:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:21:52 INFO - Reading from file tmpfile_stdout 11:21:52 INFO - Current package versions: 11:21:52 INFO - argparse == 1.2.1 11:21:52 INFO - blessings == 1.6 11:21:52 INFO - blobuploader == 1.2.4 11:21:52 INFO - docopt == 0.6.1 11:21:52 INFO - functools32 == 3.2.3-2 11:21:52 INFO - jsonschema == 2.5.1 11:21:52 INFO - manifestparser == 1.1 11:21:52 INFO - mozInstall == 1.12 11:21:52 INFO - mozcrash == 0.17 11:21:52 INFO - mozdebug == 0.1 11:21:52 INFO - mozdevice == 0.48 11:21:52 INFO - mozfile == 1.2 11:21:52 INFO - mozhttpd == 0.7 11:21:52 INFO - mozinfo == 0.9 11:21:52 INFO - mozleak == 0.1 11:21:52 INFO - mozlog == 3.2 11:21:52 INFO - moznetwork == 0.27 11:21:52 INFO - mozprocess == 0.22 11:21:52 INFO - mozprofile == 0.28 11:21:52 INFO - mozrunner == 6.11 11:21:52 INFO - mozscreenshot == 0.1 11:21:52 INFO - mozsystemmonitor == 0.3 11:21:52 INFO - moztest == 0.7 11:21:52 INFO - mozversion == 1.4 11:21:52 INFO - psutil == 3.1.1 11:21:52 INFO - requests == 1.2.3 11:21:52 INFO - wsgiref == 0.1.2 11:21:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:21:52 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')]} 11:21:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:52 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')]} 11:21:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:52 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:52 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 11:21:52 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 11:21:52 INFO - Using env: {'DISPLAY': ':0', 11:21:52 INFO - 'HOME': '/home/cltbld', 11:21:52 INFO - 'LANG': 'en_US.UTF-8', 11:21:52 INFO - 'LANGUAGE': 'en_US:en', 11:21:52 INFO - 'LOGNAME': 'cltbld', 11:21:52 INFO - 'MAIL': '/var/mail/cltbld', 11:21:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:52 INFO - 'MOZ_NO_REMOTE': '1', 11:21:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:52 INFO - 'NO_EM_RESTART': '1', 11:21:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:52 INFO - 'PWD': '/builds/slave/test', 11:21:52 INFO - 'SHELL': '/bin/bash', 11:21:52 INFO - 'SHLVL': '1', 11:21:52 INFO - 'TERM': 'linux', 11:21:52 INFO - 'TMOUT': '86400', 11:21:52 INFO - 'USER': 'cltbld', 11:21:52 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:52 INFO - '_': '/tools/buildbot/bin/python'} 11:21:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 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)) 11:21:52 INFO - Cleaning up... 11:21:52 INFO - Return code: 0 11:21:52 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:21:52 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')]} 11:21:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:52 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')]} 11:21:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:52 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:52 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 11:21:52 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 11:21:52 INFO - Using env: {'DISPLAY': ':0', 11:21:52 INFO - 'HOME': '/home/cltbld', 11:21:52 INFO - 'LANG': 'en_US.UTF-8', 11:21:52 INFO - 'LANGUAGE': 'en_US:en', 11:21:52 INFO - 'LOGNAME': 'cltbld', 11:21:52 INFO - 'MAIL': '/var/mail/cltbld', 11:21:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:52 INFO - 'MOZ_NO_REMOTE': '1', 11:21:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:52 INFO - 'NO_EM_RESTART': '1', 11:21:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:52 INFO - 'PWD': '/builds/slave/test', 11:21:52 INFO - 'SHELL': '/bin/bash', 11:21:52 INFO - 'SHLVL': '1', 11:21:52 INFO - 'TERM': 'linux', 11:21:52 INFO - 'TMOUT': '86400', 11:21:52 INFO - 'USER': 'cltbld', 11:21:52 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:52 INFO - '_': '/tools/buildbot/bin/python'} 11:21:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:52 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:21:52 INFO - Cleaning up... 11:21:52 INFO - Return code: 0 11:21:52 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 11:21:52 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')]} 11:21:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:52 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')]} 11:21:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:52 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 0x7f86996f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x180b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', '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 11:21:52 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 11:21:52 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 11:21:52 INFO - Using env: {'DISPLAY': ':0', 11:21:52 INFO - 'HOME': '/home/cltbld', 11:21:52 INFO - 'LANG': 'en_US.UTF-8', 11:21:52 INFO - 'LANGUAGE': 'en_US:en', 11:21:52 INFO - 'LOGNAME': 'cltbld', 11:21:52 INFO - 'MAIL': '/var/mail/cltbld', 11:21:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:52 INFO - 'MOZ_NO_REMOTE': '1', 11:21:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:52 INFO - 'NO_EM_RESTART': '1', 11:21:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:21:52 INFO - 'PWD': '/builds/slave/test', 11:21:52 INFO - 'SHELL': '/bin/bash', 11:21:52 INFO - 'SHLVL': '1', 11:21:52 INFO - 'TERM': 'linux', 11:21:52 INFO - 'TMOUT': '86400', 11:21:52 INFO - 'USER': 'cltbld', 11:21:52 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:21:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:52 INFO - '_': '/tools/buildbot/bin/python'} 11:21:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:52 INFO - Downloading/unpacking flake8 11:21:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:54 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 11:21:54 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 11:21:54 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 11:21:54 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 11:21:54 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 11:21:54 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 11:21:54 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 11:21:54 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 11:21:54 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 11:21:54 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 11:21:54 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 11:21:54 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 11:21:54 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 11:21:54 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 11:21:54 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 11:21:54 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 11:21:55 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 11:21:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 11:21:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:21:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:21:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:21:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:21:55 INFO - no previously-included directories found matching 'docs/_build' 11:21:55 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 11:21:55 INFO - Running setup.py install for pep8 11:21:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:21:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:21:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:21:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:21:55 INFO - no previously-included directories found matching 'docs/_build' 11:21:55 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 11:21:55 INFO - Successfully installed flake8 mccabe pyflakes pep8 11:21:55 INFO - Cleaning up... 11:21:55 INFO - Return code: 0 11:21:55 INFO - Running post-action listener: _resource_record_post_action 11:21:55 INFO - Running post-action listener: _start_resource_monitoring 11:21:55 INFO - Starting resource monitoring. 11:21:55 INFO - ##### 11:21:55 INFO - ##### Finished create-virtualenv step (success) 11:21:55 INFO - ##### 11:21:55 INFO - ##### 11:21:55 INFO - ##### Running install step. 11:21:55 INFO - ##### 11:21:55 INFO - Running pre-action listener: _resource_record_pre_action 11:21:55 INFO - Running main action method: install 11:21:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:21:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:21:55 INFO - Reading from file tmpfile_stdout 11:21:55 INFO - Detecting whether we're running mozinstall >=1.0... 11:21:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:21:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:21:56 INFO - Reading from file tmpfile_stdout 11:21:56 INFO - Output received: 11:21:56 INFO - Usage: mozinstall [options] installer 11:21:56 INFO - Options: 11:21:56 INFO - -h, --help show this help message and exit 11:21:56 INFO - -d DEST, --destination=DEST 11:21:56 INFO - Directory to install application into. [default: 11:21:56 INFO - "/builds/slave/test"] 11:21:56 INFO - --app=APP Application being installed. [default: firefox] 11:21:56 INFO - mkdir: /builds/slave/test/build/application 11:21:56 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'] 11:21:56 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 11:22:13 INFO - Reading from file tmpfile_stdout 11:22:13 INFO - Output received: 11:22:13 INFO - /builds/slave/test/build/application/firefox/firefox 11:22:13 INFO - Running post-action listener: _resource_record_post_action 11:22:13 INFO - ##### 11:22:13 INFO - ##### Finished install step (success) 11:22:13 INFO - ##### 11:22:13 INFO - ##### 11:22:13 INFO - ##### Running run-tests step. 11:22:13 INFO - ##### 11:22:13 INFO - Running pre-action listener: _resource_record_pre_action 11:22:13 INFO - Running main action method: run_tests 11:22:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:22:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:22:13 INFO - Python 2.7.3 11:22:13 INFO - Return code: 0 11:22:13 INFO - grabbing minidump binary from tooltool 11:22: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')]} 11:22:13 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 0x189a1c0>, '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 0x189b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x189b550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:22:13 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 11:22:13 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 11:22:13 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 11:22:13 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:22:13 INFO - Return code: 0 11:22:13 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:22:13 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:22:13 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:22:13 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:22:13 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:22:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 11:22:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 11:22:14 INFO - Return code: 0 11:22:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-033', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 11:22:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-033 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 11:22:14 INFO - Using env: {'DISPLAY': ':0', 11:22:14 INFO - 'HOME': '/home/cltbld', 11:22:14 INFO - 'LANG': 'en_US.UTF-8', 11:22:14 INFO - 'LANGUAGE': 'en_US:en', 11:22:14 INFO - 'LOGNAME': 'cltbld', 11:22:14 INFO - 'MAIL': '/var/mail/cltbld', 11:22:14 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:22:14 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:22:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:22:14 INFO - 'MOZ_NO_REMOTE': '1', 11:22:14 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:22:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:22:14 INFO - 'NO_EM_RESTART': '1', 11:22:14 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:22:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:22:14 INFO - 'PWD': '/builds/slave/test', 11:22:14 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:22:14 INFO - 'SHELL': '/bin/bash', 11:22:14 INFO - 'SHLVL': '1', 11:22:14 INFO - 'TERM': 'linux', 11:22:14 INFO - 'TMOUT': '86400', 11:22:14 INFO - 'USER': 'cltbld', 11:22:14 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079', 11:22:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:22:14 INFO - '_': '/tools/buildbot/bin/python'} 11:22:14 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-033', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 11:22:14 INFO - mozversion application_buildid: 20160621083052 11:22:14 INFO - mozversion application_changeset: ecd3562339dcd51a604e82efbcb347de8b823aee 11:22:14 INFO - mozversion application_display_name: Nightly 11:22:14 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:22:14 INFO - mozversion application_name: Firefox 11:22:14 INFO - mozversion application_remotingname: firefox 11:22:14 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:22:14 INFO - mozversion application_vendor: Mozilla 11:22:14 INFO - mozversion application_version: 50.0a1 11:22:14 INFO - mozversion platform_buildid: 20160621083052 11:22:14 INFO - mozversion platform_changeset: ecd3562339dcd51a604e82efbcb347de8b823aee 11:22:14 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:22:14 INFO - mozversion platform_version: 50.0a1 11:22:14 INFO - using testdate: 1466533334 11:22:14 INFO - actual date: 1466533334 11:22:14 INFO - starting webserver on 'localhost:42136' 11:22:14 INFO - SUITE-START | Running 2 tests 11:22:14 INFO - TEST-START | dromaeo_css 11:22:14 INFO - operating with platform_type : linux_ 11:22:14 INFO - Initialising browser for dromaeo_css test... 11:22:14 INFO - TEST-INFO | started process 6960 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3MBGXF/profile http://localhost:42136/getInfo.html) 11:22:19 INFO - PROCESS | 6960 | __metrics Screen width/height:1600/1200 11:22:19 INFO - PROCESS | 6960 | colorDepth:24 11:22:19 INFO - PROCESS | 6960 | Browser inner width/height: 1024/697 11:22:19 INFO - PROCESS | 6960 | __metrics 11:22:20 INFO - PROCESS | 6960 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:22:21 INFO - TEST-INFO | 6960: exit 0 11:22:21 INFO - Browser initialized. 11:22:21 INFO - Running cycle 1/1 for dromaeo_css test... 11:22:21 INFO - TEST-INFO | started process 7047 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3MBGXF/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:22:33 INFO - PROCESS | 7047 | RSS: Main: 174473216 11:22:33 INFO - PROCESS | 7047 | 11:23:24 INFO - PROCESS | 7047 | 1466533404491 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] 11:25:33 INFO - PROCESS | 7047 | Cycle 1(1): loaded http://localhost:42136/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42136/tests/dromaeo/cssquery-ext.html) 11:25:35 INFO - PROCESS | 7047 | RSS: Main: 297684992 11:25:35 INFO - PROCESS | 7047 | 11:28:37 INFO - PROCESS | 7047 | Cycle 1(1): loaded http://localhost:42136/tests/dromaeo/cssquery-ext.html (next: http://localhost:42136/tests/dromaeo/cssquery-jquery.html) 11:28:38 INFO - PROCESS | 7047 | RSS: Main: 249815040 11:28:38 INFO - PROCESS | 7047 | 11:31:40 INFO - PROCESS | 7047 | Cycle 1(1): loaded http://localhost:42136/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42136/tests/dromaeo/cssquery-mootools.html) 11:31:40 INFO - PROCESS | 7047 | RSS: Main: 260218880 11:31:40 INFO - PROCESS | 7047 | 11:34:42 INFO - PROCESS | 7047 | Cycle 1(1): loaded http://localhost:42136/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42136/tests/dromaeo/cssquery-prototype.html) 11:34:43 INFO - PROCESS | 7047 | RSS: Main: 254349312 11:34:43 INFO - PROCESS | 7047 | 11:37:45 INFO - PROCESS | 7047 | Cycle 1(1): loaded http://localhost:42136/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42136/tests/dromaeo/cssquery-yui.html) 11:37:46 INFO - PROCESS | 7047 | RSS: Main: 247459840 11:37:46 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | Cycle 1(1): loaded http://localhost:42136/tests/dromaeo/cssquery-yui.html (next: http://localhost:42136/tests/dromaeo/cssquery-dojo.html) 11:40:49 INFO - PROCESS | 7047 | RSS: Main: 345153536 11:40:49 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | __start_tp_report 11:40:49 INFO - PROCESS | 7047 | _x_x_mozilla_page_load 11:40:49 INFO - PROCESS | 7047 | _x_x_mozilla_page_load_details 11:40:49 INFO - PROCESS | 7047 | |i|pagename|runs| 11:40:49 INFO - PROCESS | 7047 | |0;dojo.html;3091.3508163285715;3124.343887783565;3140.2934339773556;3156.6843315668452;3186.984065079674;5165.38015438147;5247.973760131204;5392.056390131726;5425.620206585536;5447.019536483436;5298.258243845855;5374;5397.487238712316;5401.297831281938;5419.729013549327;4852.95661432791;4931.211006239003;4954.331165292675;4971.875703107433;5083.61872859537;4983.7508124593805;4992.301077849104;5016.598672106223;5039;5059.3422855028975;4796.040791841629;4808.711477311373;4816.614670826326;4840.491748366406;4847.49101344359;4779.689320194211;4811.350467686852;4888.315635810989;4901.681390709592;4917.50824917509;4860.198067318924;4874.46380898101;4875.122477953967;4941.283513890502;4944.653874228806;5220.3735551734035;5246.422893481714;5273.683578985273;5379.139337705988;5435.945640543623;5925.466707996258;5943.3462319144855;5944.762209511614;5945.464908158243;5947.434993675594;5899.1446240295345;5936.406359364072;5952.494038006775;5955.940440595626;5974.4324289192455;5300.284461597712;5354.973225133849;5395.892082158335;5404.540614047772;5509.669419834822;5898.056310990221;5904.61619994699;5957.4638282553915;5966.612170208922;5972.492338151219;5729.427057294321;5736.77052917887;5737.540996720252;5752.165935939349;5757.136429535603;5555.111182210908;5720.456556627114;5769.624974376652;5770.88458230833;5801.390853960358;5741.913871291934;5774.2782152230975;5775.884482310415;5785.82642520725;5793.073108302651;5553.1670249462095;5720.456556627114;5757.395473475225;5778.27771528559;5781.479666830005;4290;4329.588689074533;4343.522212556616;4350.477942646902;4412.911741765147;3893.5717071122153;3913.8238779255003;3916.236333914916;3949.2101579684177;3964.8414063437717;5428.511433970962;5433.864153396196;5439.238506609078;5439.966406382775;5442.782288708408;5582.553395728332;5686.3744988051285;5745.2818397700285;5754.136879468029;5769.249997500298;5459.863503412446;5464.781408743605;5466.125419932791;5468.9726551367785;5469.671819690831;4867.488913664014;4984.825531106394;4992.051510213048;5002.97439024999;5047.369078865142;5927.288725352899;6028.788992385245;6044.123602077762;6070.514358851281;6075.210222671201;5855.560832937462;5862.501687356452;5863.589548731547;5866.090755932837;5866.823995280149;5680.886382272249;5834.504067154339;6055.576109672281;6060.363661815446;6066.272047354346;5522.3649280333275;5584.664920104807;5621.550275977994;5629.971850140887;5636.718164091697;5568.136938774496;5658.349289831557;5665.3201615806365;5683.090705487102;5712.685802280915;5544.61187716856;5577.470140336662;5586.217929489793;5589.972050139723;5598.664080155204;5641.915371269352;5682.346530149086;5697.54419646419;5732.340780810094;5735.9139612905;5609.1305847593685;5609.719514024364;5613.158026296088;5613.382527922007;5614.52276556481;5496.230527726201;5555.555555555465;5747.4252574742195;5806.042003069446;5814.622049566765;5500.367457742411;5559.138333558305;5560.110382338807;5561.749721262472;5613 11:40:49 INFO - PROCESS | 7047 | |1;ext.html;579.7159391897972;584.8303991842366;607.6931149769366;609.3845216331504;619.857432790458;30542.38915221697;42483.78758106209;43321;43694;43702.7814860926;43115.137697246035;45130.77434612822;45177.09645807082;45294.773526132405;45339.639810805646;8179.836403271931;8815.074417186199;8971.910280897173;10611.734706632358;10876.293040952352;10732.839007414896;10798.298110622824;10798.838017429705;10813.459327033655;10820.296680715768;10727.731806704816;10778.353298802096;10782;10811.83782243263;10836.945815270912;10699.144068474543;10745.194110441747;10764.24650274481;10768.407737574431;10827.67516974492;10584.629537966212;10691.679249622524;10722.571097156104;10733.570657173703;10742.086922611586;41402.37896431556;41732;41810;41810.37284440736;41911;3249.658785827478;3267.3465306938706;3448.189675426273;3791.6777073948747;4094.897627559335;32021.519677204862;32037.359252815048;32641.51037734436;32859.83570082158;33603;4302.9569704303185;4353.216421044211;4396.516383197845;4396.956030439686;4465.129299786543;321026;322540;325549;325840.3707981469;326002;57544.42455575475;57981.71009144927;57997.42002580005;58225.417745822844;58493.70753146207;61588.69205653943;61655.69172154111;61684;61908.38091619116;61980.69009654923;13225.537106201236;13317.533886313933;13331.333433328295;13334.933325333504;13362.599122026355;12073.396330183456;12166.330851803235;12173.817392739116;12174.756504869853;12189.085818563466;6497.545171838021;7896.763097107096;8184.263416292562;8197.426180167451;8361.080281169066;7097.361237488651;7117.928820711727;7122.219445138715;7326.633668316563;7333.559986400833;930.7812664023949;982.6069572171189;989.569537251298;1019.6991887393236;1039.0804138337473;33046.8347658265;33382.66617333796;33735.15662108418;33805;34251.82874085614;1071.8231491803922;1152.193464574801;1152.3949926288765;1156.653004098767;1161.5528021711702;17178.484645460405;17457;17543.91228043877;17555.648887022187;17599.73600395995;521002;521771;522568;523696;531645;58296.4170358291;59699.40300596938;60095.59139677363;60114.086880008486;60119.699401502716;1135.6593022093339;1269.828573142614;1303.387407918277;1325.5890673891124;1328.7276108397755;29398;30626.540601890545;30966.845165774026;31081.689183108785;31540.211494712818;49131.26303105528;49184.75407622939;49442.75278623584;49941.25088123754;50248.497515024384;387889;398468;398704;400659;400740;26835.463290734468;28443.573346400233;28906.27734306659;29237.41525169527;29509.409811803213;44644.77677611591;47742.94184994314;48243.75878120587;48819.26771098508;49334;34919.476207856394;35231.82384088063;35302;35536;35550.64449355473;33908.15229619279;34384.656153439144;34403.31193376169;34447.31105377928;34744.82627586846;36153.638463615025;36233.81883090568;36961;37026.62973370232;37181.81409092937;35541;35562.64437355593;36675.633243667224;36902;37129;27541.449171016066;27908.30229244204;28301.57547636828;28316;28320 11:40:49 INFO - PROCESS | 7047 | |2;jquery.html;374.9164913400273;383.73522269633935;392.98231579578913;403.09304065851836;403.3304714174471;17391.826081739193;19339.90330048348;19405.611887762254;19858.801411985893;19868.105935232914;18136.274549018057;18249.36127235547;18922.959237241947;19324.227030918748;19597.314094006713;5580.6372585782;5581.832545023656;5823;5837.066069428893;5838.124281357809;5655.3779084300695;5706.258186435778;5724.34170070441;5782.653040817543;5783.942160578404;5472.50747432731;5619.9884020876225;5691.117876729114;5694.857628559298;5695.373508914037;5654.74553645087;5654.886902261932;5675.063614503602;5698.7435565399655;5698.857528561778;4999.175136102539;5030.4215015272985;5050.898982020376;5061.873453163664;5086.949130508721;22254.109835606556;22324.665130023062;22513.662295065587;23193.188238411574;23213;2319.7100362454694;2365.5150694107665;2506.572657743777;2633.644457998165;2647.7617014468597;14293.285335733275;14310.713785724227;14433.422663093568;14590.343434545472;14866.033707809065;1897.193692680619;1909.5703466720015;1947.9026048697508;2012.8993550322425;2027.108072448118;79995;80056.59971700162;80128;81667;82231.58884205601;10188.184945204366;10239.948800255952;10522.473876306154;10707.30402523849;10759;14861.777073343908;14924.283707373574;14943.327550260265;14946.402143914122;14974.401023959137;7566.394688424913;7845.254700803414;7887;7960.960195198987;7968.402369822171;7487.625618719042;7626;7652.120006199247;7679.155292917774;7829.334506566892;6474.223093228843;6527.82499150148;6586.176727909012;6613.966930165318;6625.635590042594;1883.5761953560338;1889.914953827081;1893.4603637963114;1903;1904.419152158605;954.4511905654276;1022.2946167144646;1041.6406339812752;1068.5191663751189;1108.7505311304892;18466.907665461586;19973.500662483555;20965.68551471729;20982.160713571593;21029.15883364648;953.699584630839;962.5283611030544;985.4973963278779;986.6053578568486;998.8751406074241;10767.138628909668;11073.50169242386;11229.887701123047;11352.602658906899;11415.143864210217;487443;490493;496868;531482.1110733368;540425;91894.54052729694;94850.52574737082;96885;96965;96965.0303496956;1002.293383164867;1015.7968406318765;1036.4558606731525;1041.671873359889;1042.6976176908915;16535.421260256313;17372.305107795546;17733.822661773218;18097;18114.27542898269;42743.786281068395;42795.6112166635;43655.34516982184;43795.12409751723;44318.556814431446;55497.1675424877;57484.71257643685;57709.13436298375;58378.4162158373;58551.70724146352;8424.368172386972;8638.82722345537;8822.691205807765;8864.379493435397;8930.240929520804;10185.388876667424;13381.126642269895;13614.591562253148;13739.931300343434;14110.50613228532;11249.381284029458;11965.461554229907;12015.219010764273;12230.510779569073;12412.75174496487;11625.767484650429;11823.586174483851;12017.278963262232;12058.819117713067;12125.393730313626;11479.311241325548;12123.75752484963;12274.202176858476;12320.75358492843;12891;7129.322714342129;8546.871796922927;8710.956445217733;8959;8979.326550508607;9799.85300220483;11364.374959377314;11726.472308746297;12230.205036672587;12487 11:40:49 INFO - PROCESS | 7047 | |3;mootools.html;1230.661568068781;1246.414185332893;1319.2809918594364;1364.9830875997382;1489.6797188604455;8285.54429506377;8655.177758112985;8677.522736249504;8907.28741700664;8922.241609463203;8676.913230867689;8683.522406267653;8759.693410730626;8767.780805479866;8777.253933415652;2250.2686626846257;2281.3954302109955;2284.2804516577307;2285.165914441225;2287.142321629389;2235.485838257202;2251.0320562158267;2318.8956496957676;2320.164740693349;2323.9535209295805;2291.186628746796;2312.5721741477796;2316.108298305148;2320.8143348532076;2330.0446816805115;2230.230570453191;2258.836699099965;2261.378121016717;2262.988685056581;2266.263464374085;2266.3654176830514;2268.557631261888;2273.4202778291597;2274.8407611467205;2276.3853759485014;8614.56927153646;8729;8772.210501054935;8778.47329160246;8795.032546419889;4985.675931064469;5168.3281173447585;5177.870553236199;5180;5191.169412893919;3249.528818321354;3366.377220214268;3422.828858557062;3433.141714571357;3445.810480423576;1165.5862168930078;1192.4991503568522;1217.6834023153956;1229.8524177098716;2154.644483660194;11877;12314.630561083091;12325.445354959138;12338.444769985372;12344.567940122053;4252.298370768788;4424.513303536608;4439.4006809080365;4498.797554110073;4509.819607215741;9629.518524073768;9695.660651877291;9714.125728684452;9720.708378748648;9733.270004749673;4889.315495830587;4917.409910810726;4939.777710003059;4967.850964471072;4970.179920313108;4078.490188726409;4234.364845273172;4611.631069514431;4627.9074418511445;4726.95273047272;3644.7630903991158;3647.7993710346186;3668.6514781095752;3698.1863989922176;3728.925421491555;1072.6996440996534;1086.750047489082;1087.7226307291749;1088.0207812968392;1104.6354702948008;857.4983634573845;861.4960248254716;990.5691024404407;999.020959459719;1009.1523120578603;5812.767489300465;6069.180660610849;6131.938680613226;6200.410960958701;6319.778807741707;431.78195011518983;436.8230866499073;441.5099239843771;446.98212071516775;448.0434272827472;4106.597640380352;4247.129338485603;4290.549492303326;4326.091520780671;4326.4159338489535;10652.573897044187;10666.78666426667;11003.504842282116;11060.115190784718;11093.057090147266;10833.187510936554;10913.945430272957;10977.176711746652;10979.451027448597;11050.944745276222;8186.959065204755;8231.876521852177;8263.297619702273;8280.461769984931;8330.458520196167;5847.38602446737;5913.432940270745;5990.910136348046;6152.077188421773;6349.269833969152;9508.191803696764;9938.509223616515;9972;10047.949760251153;10094.394336339843;10074.294799364267;10228.437435941094;10324.07083362501;10405.531751071372;10420.68737937863;7183.604901730455;7330.157031941395;7514.736984205527;7556.357709594746;7708.49894756839;8299.419040667337;8324.875126873223;8344.207300306462;8405.453645513267;8406.621702023302;7739.458237923292;7740.071191456836;7821.648025838737;7892.289693927574;7932.6033698316005;7073.292670733092;7302.196758356683;7311.817204569928;7570.621468926422;7770.3395211405405;6911.067005954132;7001.859962800817;7006.334398232159;7063;7070.893936590853;5117.8720531987;5217.50433708797;5217.8173763918085;5300.469953004823;5441.183822426668;4965.528274813887;5331.680099194061;5339.919901201408;5356.544693701079;5434.728263586726 11:40:49 INFO - PROCESS | 7047 | |4;prototype.html;306.16569847166477;309.9411111888741;315.8468142950669;324.71262932304904;329.1573571656559;5215.843524694265;5402.648827826199;5439.864003399917;5475.589330800191;5502.80740174094;5350.35795704515;5363.793146542036;5420.696204113256;5438.864028399292;5472.753726082326;4172.144710334374;4186.330187170053;4195.181939521794;4215.978920105395;4220.788960551968;3889.747166434187;4087.976451656419;4219.156168766243;4238.088810905655;4246.087091275375;4149.688773342012;4183.979080104596;4191.637717741746;4206.432131662233;4208.2845916194165;4171.436856024428;4171.541130475661;4227.429297044921;4253.851115210984;4277.764722940237;3675.9816200918826;3721.5162028936065;3751.4185301278344;3764.4541541476333;3770.5852356240794;5201.843944681666;5211;5212.462323614543;5258.894822103574;5261.3686357637325;4768.189407800683;4788.904221915577;4796.472388037348;4803.615710743132;4811.4707382187935;5444.7822087116465;5671.943280567183;5709.800156994527;5712.1435533451795;5714.542836573064;4049.7772622506045;4063.918721625551;4063.9796801015805;4085.20338533986;4093.9385909211387;5880.26496687914;5882.588218824684;5900.527957763368;5908;5929.73316200772;4048.3117869962175;4132.607402296777;4153.813078411479;4160.439835061852;4170.124273902454;4188.874333769992;4197.433346498245;4204.117135401539;4209.5579964103945;4219.008532994744;4788.640851936049;4791.377120974251;4794.664373493892;4819.421669399624;4821.143859614074;5581.581381396411;5677.545796336366;5754.88490230193;5755.8273251801675;5771.134329850472;1388.7500249954903;1413.6395219219032;1438.96402589934;1471.2864260833487;1473.8010368600317;917.9678711245074;930.6556574067638;931.2736065868634;937.9859302110474;950.7022913722718;4900.730459824744;4910.533499317559;4916.237983112624;4933.358663373739;4952.380952380952;5147.382314122255;5157.948420515747;5190.6107041971245;5214.374275087014;5215.921761173586;4616.699914505546;4866.902661946741;4870.537298956593;4898.706077635354;4901.485344038896;2705.3371923878776;2734.2890848379566;2736.480068786924;2751.4866823247135;2752.9174124776287;5167.354080739908;5212.983468223736;5229.320188375486;5251.52736253739;5269.919666468365;4862.270659401118;5185.766640501187;5194.532492075731;5195.19474481456;5255.08036093682;5258.8948221036135;5262.500062494057;5292.576593872481;5298.576113910955;5302.621318457152;5128.615353848401;5174.62872338838;5182.548886311839;5187.688738675692;5235.345581802275;4759.571638552547;5062.392512898476;5072.847814565569;5105.4384017757275;5119.590432765444;5225.764840582106;5308.823382413192;5350.4382039886805;5370.301860758076;5394.811181608625;3791.507104076563;3831.8658846940225;3872.7482713623526;3883.9223215536094;3896.454496370454;4920.810239443414;5214.4617337886175;5300.178472336794;5590.329160500766;5619.297587801525;5652.5477961762135;5698.808667146412;5704.458076482728;5720.313562372542;5754.971225143848;5632.295963004624;5665.801696940587;5686.886262274814;5711.257536520226;5725.341585717696;5467.371252305877;5546.766216330863;5588.944110558842;5613.46672066153;5634.267545219095;5651.406602306863;5757.136429535603;5766.279215098113;5768.278965129359;5772.365039845529;5440;5584.804531841366;5591.720413979204;5646.407127251579;5675.772969081356 11:40:49 INFO - PROCESS | 7047 | |5;yui.html;701.2216439751875;734.8016035670369;769.9404094048421;780.7189411811743;817.5094943034178;14471.638209044779;15290.31193596288;15472.071675699437;15515.612109697264;15647.061176329427;13473.73052538951;13567.864321356783;13573.660658483543;13583.252921089335;13624.046316757831;634.5431289471574;726.0923845193508;773.161120184599;781.4451739265129;784.6273020315361;780.7228433905967;787.7676085554747;788.0897563314353;789.03737440323;789.5026133535864;816.7876352148454;831.7255305749119;833.4499230507867;833.6165363932598;834.1200033964166;677.0791723256367;758.8254701418705;833.8374017066675;834.3033566971586;837.4347315562002;582.1035605168037;590.9143174239712;602.1449541650823;605.1618508365945;606.9241344831896;14057.5079872205;14091.577252682437;14105.083169593943;14148.92925535376;14152.716945661132;13688;14375.353109110116;14381.44814981755;14532;14671.33978970949;13088.149270297401;13132.803007954888;13324.533641322603;13353.933230333787;13716;4447.155040542287;4467.553244675539;4503.4145561077175;4644.280136578802;4690.882727931795;75589;75999.99999999945;76053;76399;76790.61604691941;10578.52396642153;10674.573017079385;11017.504212310465;11021;11416.771664566662;19957.20171193136;19957.800421995595;19966.70049949252;19974;19978.70031949522;7619.69521219145;7817.257360550739;7971.242731940456;8015.238552337519;8032;4427.623651989553;4475.507694153641;4569.520200378979;4646.605038571759;4651.767411629405;3348.079278198466;3471.0801637566065;3478.599961004517;3480.634533373959;3496.8076755778675;549.6976662835425;566.4618612318314;569.5272923473507;582.5019608234899;602.2682440834408;525.8422473258007;566.2242727463401;594.482799964034;656.3305428462941;675.3617831149614;8021.27808497238;8778.868316975251;8960.641574337084;9084.81830363389;9147;599.6641880546821;607.9209702738616;618.8669436071176;632.8069938668658;658.509410489179;4309.41822853917;4316.6330861877095;4339.934900976488;4409.426774519292;4504.48198457175;107654;109441.71674849767;110169;113174.43412782883;115015;96486;96625.5168724166;96759.51620241854;97212.51393742986;99055;85066;86008.56995714981;87171;88293.11706882977;89376;8133.735760492838;8139.4709343892455;8354.16458354184;8402.453840500348;8414.3268538518;48803;50635;50997.7450112747;51947.48052519427;52827.47172528225;66863.66568167128;67440.6627966857;74821.62589187238;76337;76785.85713143047;10561.735956601147;10593.09958653523;10825.837612435977;10908.400037997986;10997.945010274898;11636.301821890713;11739.23694959825;12278.631641050782;12354.876451235732;12405.13164078542;11619;11862.525498979945;11882.58410955647;12089;12235;10982.395968221825;11770.470328835052;11968.820467692818;12407.007439405006;12743.49026038948;11630.825537616773;11728.237664552118;11752;11786.823197651871;11936.788310302842;9254.722358329262;9314.161725444743;9419.952900235456;9499.857502137334;9509.334346595671;9393.436393816393;9593.28050396237;9603.9039609603;9662.903370966482;9725.610975561181 11:40:49 INFO - PROCESS | 7047 | __end_tp_report 11:40:49 INFO - PROCESS | 7047 | __start_cc_report 11:40:49 INFO - PROCESS | 7047 | _x_x_mozilla_cycle_collect,1034 11:40:49 INFO - PROCESS | 7047 | __end_cc_report 11:40:49 INFO - PROCESS | 7047 | __startTimestamp1466534449555__endTimestamp 11:40:49 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | ------- Summary: start ------- 11:40:49 INFO - PROCESS | 7047 | Number of tests: 6 11:40:49 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | [#0] dojo.html Cycles:165 Average:5363.07 Median:5559.14 stddev:619.56 (11.1%) stddev-sans-first:595.27 11:40:49 INFO - PROCESS | 7047 | Values: 3091.4 3124.3 3140.3 3156.7 3187.0 5165.4 5248.0 5392.1 5425.6 5447.0 5298.3 5374.0 5397.5 5401.3 5419.7 4853.0 4931.2 4954.3 4971.9 5083.6 4983.8 4992.3 5016.6 5039.0 5059.3 4796.0 4808.7 4816.6 4840.5 4847.5 4779.7 4811.4 4888.3 4901.7 4917.5 4860.2 4874.5 4875.1 4941.3 4944.7 5220.4 5246.4 5273.7 5379.1 5435.9 5925.5 5943.3 5944.8 5945.5 5947.4 5899.1 5936.4 5952.5 5955.9 5974.4 5300.3 5355.0 5395.9 5404.5 5509.7 5898.1 5904.6 5957.5 5966.6 5972.5 5729.4 5736.8 5737.5 5752.2 5757.1 5555.1 5720.5 5769.6 5770.9 5801.4 5741.9 5774.3 5775.9 5785.8 5793.1 5553.2 5720.5 5757.4 5778.3 5781.5 4290.0 4329.6 4343.5 4350.5 4412.9 3893.6 3913.8 3916.2 3949.2 3964.8 5428.5 5433.9 5439.2 5440.0 5442.8 5582.6 5686.4 5745.3 5754.1 5769.2 5459.9 5464.8 5466.1 5469.0 5469.7 4867.5 4984.8 4992.1 5003.0 5047.4 5927.3 6028.8 6044.1 6070.5 6075.2 5855.6 5862.5 5863.6 5866.1 5866.8 5680.9 5834.5 6055.6 6060.4 6066.3 5522.4 5584.7 5621.6 5630.0 5636.7 5568.1 5658.3 5665.3 5683.1 5712.7 5544.6 5577.5 5586.2 5590.0 5598.7 5641.9 5682.3 5697.5 5732.3 5735.9 5609.1 5609.7 5613.2 5613.4 5614.5 5496.2 5555.6 5747.4 5806.0 5814.6 5500.4 5559.1 5560.1 5561.7 5613.0 11:40:49 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | [#1] ext.html Cycles:180 Average:57461.33 Median:35419.00 stddev:112232.75 (316.9%) stddev-sans-first:112466.34 11:40:49 INFO - PROCESS | 7047 | Values: 579.7 584.8 607.7 609.4 619.9 30542.4 42483.8 43321.0 43694.0 43702.8 43115.1 45130.8 45177.1 45294.8 45339.6 8179.8 8815.1 8971.9 10611.7 10876.3 10732.8 10798.3 10798.8 10813.5 10820.3 10727.7 10778.4 10782.0 10811.8 10836.9 10699.1 10745.2 10764.2 10768.4 10827.7 10584.6 10691.7 10722.6 10733.6 10742.1 41402.4 41732.0 41810.0 41810.4 41911.0 3249.7 3267.3 3448.2 3791.7 4094.9 32021.5 32037.4 32641.5 32859.8 33603.0 4303.0 4353.2 4396.5 4397.0 4465.1 321026.0 322540.0 325549.0 325840.4 326002.0 57544.4 57981.7 57997.4 58225.4 58493.7 61588.7 61655.7 61684.0 61908.4 61980.7 13225.5 13317.5 13331.3 13334.9 13362.6 12073.4 12166.3 12173.8 12174.8 12189.1 6497.5 7896.8 8184.3 8197.4 8361.1 7097.4 7117.9 7122.2 7326.6 7333.6 930.8 982.6 989.6 1019.7 1039.1 33046.8 33382.7 33735.2 33805.0 34251.8 1071.8 1152.2 1152.4 1156.7 1161.6 17178.5 17457.0 17543.9 17555.6 17599.7 521002.0 521771.0 522568.0 523696.0 531645.0 58296.4 59699.4 60095.6 60114.1 60119.7 1135.7 1269.8 1303.4 1325.6 1328.7 29398.0 30626.5 30966.8 31081.7 31540.2 49131.3 49184.8 49442.8 49941.3 50248.5 387889.0 398468.0 398704.0 400659.0 400740.0 26835.5 28443.6 28906.3 29237.4 29509.4 44644.8 47742.9 48243.8 48819.3 49334.0 34919.5 35231.8 35302.0 35536.0 35550.6 33908.2 34384.7 34403.3 34447.3 34744.8 36153.6 36233.8 36961.0 37026.6 37181.8 35541.0 35562.6 36675.6 36902.0 37129.0 27541.4 27908.3 28301.6 28316.0 28320.0 11:40:49 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | [#2] jquery.html Cycles:180 Average:29828.62 Median:2570.11 stddev:83999.02 (3268.3%) stddev-sans-first:84205.54 11:40:49 INFO - PROCESS | 7047 | Values: 374.9 383.7 393.0 403.1 403.3 17391.8 19339.9 19405.6 19858.8 19868.1 18136.3 18249.4 18923.0 19324.2 19597.3 5580.6 5581.8 5823.0 5837.1 5838.1 5655.4 5706.3 5724.3 5782.7 5783.9 5472.5 5620.0 5691.1 5694.9 5695.4 5654.7 5654.9 5675.1 5698.7 5698.9 4999.2 5030.4 5050.9 5061.9 5086.9 22254.1 22324.7 22513.7 23193.2 23213.0 2319.7 2365.5 2506.6 2633.6 2647.8 14293.3 14310.7 14433.4 14590.3 14866.0 1897.2 1909.6 1947.9 2012.9 2027.1 79995.0 80056.6 80128.0 81667.0 82231.6 10188.2 10239.9 10522.5 10707.3 10759.0 14861.8 14924.3 14943.3 14946.4 14974.4 7566.4 7845.3 7887.0 7961.0 7968.4 7487.6 7626.0 7652.1 7679.2 7829.3 6474.2 6527.8 6586.2 6614.0 6625.6 1883.6 1889.9 1893.5 1903.0 1904.4 954.5 1022.3 1041.6 1068.5 1108.8 18466.9 19973.5 20965.7 20982.2 21029.2 953.7 962.5 985.5 986.6 998.9 10767.1 11073.5 11229.9 11352.6 11415.1 487443.0 490493.0 496868.0 531482.1 540425.0 91894.5 94850.5 96885.0 96965.0 96965.0 1002.3 1015.8 1036.5 1041.7 1042.7 16535.4 17372.3 17733.8 18097.0 18114.3 42743.8 42795.6 43655.3 43795.1 44318.6 55497.2 57484.7 57709.1 58378.4 58551.7 8424.4 8638.8 8822.7 8864.4 8930.2 10185.4 13381.1 13614.6 13739.9 14110.5 11249.4 11965.5 12015.2 12230.5 12412.8 11625.8 11823.6 12017.3 12058.8 12125.4 11479.3 12123.8 12274.2 12320.8 12891.0 7129.3 8546.9 8711.0 8959.0 8979.3 9799.9 11364.4 11726.5 12230.2 12487.0 11:40:49 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | [#3] mootools.html Cycles:180 Average:5723.56 Median:4619.77 stddev:3299.98 (71.4%) stddev-sans-first:3291.96 11:40:49 INFO - PROCESS | 7047 | Values: 1230.7 1246.4 1319.3 1365.0 1489.7 8285.5 8655.2 8677.5 8907.3 8922.2 8676.9 8683.5 8759.7 8767.8 8777.3 2250.3 2281.4 2284.3 2285.2 2287.1 2235.5 2251.0 2318.9 2320.2 2324.0 2291.2 2312.6 2316.1 2320.8 2330.0 2230.2 2258.8 2261.4 2263.0 2266.3 2266.4 2268.6 2273.4 2274.8 2276.4 8614.6 8729.0 8772.2 8778.5 8795.0 4985.7 5168.3 5177.9 5180.0 5191.2 3249.5 3366.4 3422.8 3433.1 3445.8 1165.6 1192.5 1217.7 1229.9 2154.6 11877.0 12314.6 12325.4 12338.4 12344.6 4252.3 4424.5 4439.4 4498.8 4509.8 9629.5 9695.7 9714.1 9720.7 9733.3 4889.3 4917.4 4939.8 4967.9 4970.2 4078.5 4234.4 4611.6 4627.9 4727.0 3644.8 3647.8 3668.7 3698.2 3728.9 1072.7 1086.8 1087.7 1088.0 1104.6 857.5 861.5 990.6 999.0 1009.2 5812.8 6069.2 6131.9 6200.4 6319.8 431.8 436.8 441.5 447.0 448.0 4106.6 4247.1 4290.5 4326.1 4326.4 10652.6 10666.8 11003.5 11060.1 11093.1 10833.2 10913.9 10977.2 10979.5 11050.9 8187.0 8231.9 8263.3 8280.5 8330.5 5847.4 5913.4 5990.9 6152.1 6349.3 9508.2 9938.5 9972.0 10047.9 10094.4 10074.3 10228.4 10324.1 10405.5 10420.7 7183.6 7330.2 7514.7 7556.4 7708.5 8299.4 8324.9 8344.2 8405.5 8406.6 7739.5 7740.1 7821.6 7892.3 7932.6 7073.3 7302.2 7311.8 7570.6 7770.3 6911.1 7001.9 7006.3 7063.0 7070.9 5117.9 5217.5 5217.8 5300.5 5441.2 4965.5 5331.7 5339.9 5356.5 5434.7 11:40:49 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | [#4] prototype.html Cycles:180 Average:4578.11 Median:5170.99 stddev:1323.84 (25.6%) stddev-sans-first:1288.14 11:40:49 INFO - PROCESS | 7047 | Values: 306.2 309.9 315.8 324.7 329.2 5215.8 5402.6 5439.9 5475.6 5502.8 5350.4 5363.8 5420.7 5438.9 5472.8 4172.1 4186.3 4195.2 4216.0 4220.8 3889.7 4088.0 4219.2 4238.1 4246.1 4149.7 4184.0 4191.6 4206.4 4208.3 4171.4 4171.5 4227.4 4253.9 4277.8 3676.0 3721.5 3751.4 3764.5 3770.6 5201.8 5211.0 5212.5 5258.9 5261.4 4768.2 4788.9 4796.5 4803.6 4811.5 5444.8 5671.9 5709.8 5712.1 5714.5 4049.8 4063.9 4064.0 4085.2 4093.9 5880.3 5882.6 5900.5 5908.0 5929.7 4048.3 4132.6 4153.8 4160.4 4170.1 4188.9 4197.4 4204.1 4209.6 4219.0 4788.6 4791.4 4794.7 4819.4 4821.1 5581.6 5677.5 5754.9 5755.8 5771.1 1388.8 1413.6 1439.0 1471.3 1473.8 918.0 930.7 931.3 938.0 950.7 4900.7 4910.5 4916.2 4933.4 4952.4 5147.4 5157.9 5190.6 5214.4 5215.9 4616.7 4866.9 4870.5 4898.7 4901.5 2705.3 2734.3 2736.5 2751.5 2752.9 5167.4 5213.0 5229.3 5251.5 5269.9 4862.3 5185.8 5194.5 5195.2 5255.1 5258.9 5262.5 5292.6 5298.6 5302.6 5128.6 5174.6 5182.5 5187.7 5235.3 4759.6 5062.4 5072.8 5105.4 5119.6 5225.8 5308.8 5350.4 5370.3 5394.8 3791.5 3831.9 3872.7 3883.9 3896.5 4920.8 5214.5 5300.2 5590.3 5619.3 5652.5 5698.8 5704.5 5720.3 5755.0 5632.3 5665.8 5686.9 5711.3 5725.3 5467.4 5546.8 5588.9 5613.5 5634.3 5651.4 5757.1 5766.3 5768.3 5772.4 5440.0 5584.8 5591.7 5646.4 5675.8 11:40:49 INFO - PROCESS | 7047 | 11:40:49 INFO - PROCESS | 7047 | [#5] yui.html Cycles:180 Average:20067.49 Median:26688.58 stddev:29547.98 (110.7%) stddev-sans-first:29595.09 11:40:49 INFO - PROCESS | 7047 | Values: 701.2 734.8 769.9 780.7 817.5 14471.6 15290.3 15472.1 15515.6 15647.1 13473.7 13567.9 13573.7 13583.3 13624.0 634.5 726.1 773.2 781.4 784.6 780.7 787.8 788.1 789.0 789.5 816.8 831.7 833.4 833.6 834.1 677.1 758.8 833.8 834.3 837.4 582.1 590.9 602.1 605.2 606.9 14057.5 14091.6 14105.1 14148.9 14152.7 13688.0 14375.4 14381.4 14532.0 14671.3 13088.1 13132.8 13324.5 13353.9 13716.0 4447.2 4467.6 4503.4 4644.3 4690.9 75589.0 76000.0 76053.0 76399.0 76790.6 10578.5 10674.6 11017.5 11021.0 11416.8 19957.2 19957.8 19966.7 19974.0 19978.7 7619.7 7817.3 7971.2 8015.2 8032.0 4427.6 4475.5 4569.5 4646.6 4651.8 3348.1 3471.1 3478.6 3480.6 3496.8 549.7 566.5 569.5 582.5 602.3 525.8 566.2 594.5 656.3 675.4 8021.3 8778.9 8960.6 9084.8 9147.0 599.7 607.9 618.9 632.8 658.5 4309.4 4316.6 4339.9 4409.4 4504.5 107654.0 109441.7 110169.0 113174.4 115015.0 96486.0 96625.5 96759.5 97212.5 99055.0 85066.0 86008.6 87171.0 88293.1 89376.0 8133.7 8139.5 8354.2 8402.5 8414.3 48803.0 50635.0 50997.7 51947.5 52827.5 66863.7 67440.7 74821.6 76337.0 76785.9 10561.7 10593.1 10825.8 10908.4 10997.9 11636.3 11739.2 12278.6 12354.9 12405.1 11619.0 11862.5 11882.6 12089.0 12235.0 10982.4 11770.5 11968.8 12407.0 12743.5 11630.8 11728.2 11752.0 11786.8 11936.8 9254.7 9314.2 9420.0 9499.9 9509.3 9393.4 9593.3 9603.9 9662.9 9725.6 11:40:49 INFO - PROCESS | 7047 | -------- Summary: end -------- 11:40:49 INFO - PROCESS | 7047 | 11:40:50 INFO - TEST-INFO | 7047: exit 0 11:40:50 INFO - TEST-OK | dromaeo_css | took 1116075ms 11:40:50 INFO - TEST-START | kraken 11:40:50 INFO - operating with platform_type : linux_ 11:40:50 INFO - Initialising browser for kraken test... 11:40:50 INFO - TEST-INFO | started process 7225 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmggUUv/profile http://localhost:42136/getInfo.html) 11:40:55 INFO - PROCESS | 7225 | __metrics Screen width/height:1600/1200 11:40:55 INFO - PROCESS | 7225 | colorDepth:24 11:40:55 INFO - PROCESS | 7225 | Browser inner width/height: 1024/697 11:40:55 INFO - PROCESS | 7225 | __metrics 11:40:56 INFO - PROCESS | 7225 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:40:57 INFO - TEST-INFO | 7225: exit 0 11:40:57 INFO - Browser initialized. 11:40:57 INFO - Running cycle 1/1 for kraken test... 11:40:57 INFO - TEST-INFO | started process 7307 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmggUUv/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:41:09 INFO - PROCESS | 7307 | RSS: Main: 173748224 11:41:09 INFO - PROCESS | 7307 | 11:41:11 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42136/tests/kraken/driver.html?testName=audio-beat-detection) 11:41:12 INFO - PROCESS | 7307 | RSS: Main: 232787968 11:41:12 INFO - PROCESS | 7307 | 11:41:15 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42136/tests/kraken/driver.html?testName=audio-dft) 11:41:16 INFO - PROCESS | 7307 | RSS: Main: 220508160 11:41:16 INFO - PROCESS | 7307 | 11:41:19 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42136/tests/kraken/driver.html?testName=audio-fft) 11:41:19 INFO - PROCESS | 7307 | RSS: Main: 287666176 11:41:19 INFO - PROCESS | 7307 | 11:41:21 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42136/tests/kraken/driver.html?testName=audio-oscillator) 11:41:22 INFO - PROCESS | 7307 | RSS: Main: 198189056 11:41:22 INFO - PROCESS | 7307 | 11:41:24 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42136/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:41:25 INFO - PROCESS | 7307 | RSS: Main: 202088448 11:41:25 INFO - PROCESS | 7307 | 11:41:28 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42136/tests/kraken/driver.html?testName=imaging-darkroom) 11:41:28 INFO - PROCESS | 7307 | RSS: Main: 236232704 11:41:28 INFO - PROCESS | 7307 | 11:41:32 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42136/tests/kraken/driver.html?testName=imaging-desaturate) 11:41:32 INFO - PROCESS | 7307 | RSS: Main: 239378432 11:41:32 INFO - PROCESS | 7307 | 11:41:35 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42136/tests/kraken/driver.html?testName=json-parse-financial) 11:41:36 INFO - PROCESS | 7307 | RSS: Main: 238800896 11:41:36 INFO - PROCESS | 7307 | 11:41:37 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42136/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:41:38 INFO - PROCESS | 7307 | RSS: Main: 225697792 11:41:38 INFO - PROCESS | 7307 | 11:41:40 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42136/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:41:40 INFO - PROCESS | 7307 | RSS: Main: 227979264 11:41:40 INFO - PROCESS | 7307 | 11:41:42 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42136/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:41:43 INFO - PROCESS | 7307 | RSS: Main: 236318720 11:41:43 INFO - PROCESS | 7307 | 11:41:45 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42136/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:41:46 INFO - PROCESS | 7307 | RSS: Main: 240881664 11:41:46 INFO - PROCESS | 7307 | 11:41:49 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42136/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:41:49 INFO - PROCESS | 7307 | RSS: Main: 238428160 11:41:49 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | Cycle 1(1): loaded http://localhost:42136/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42136/tests/kraken/driver.html?testName=ai-astar) 11:41:51 INFO - PROCESS | 7307 | RSS: Main: 281231360 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | __start_tp_report 11:41:51 INFO - PROCESS | 7307 | _x_x_mozilla_page_load 11:41:51 INFO - PROCESS | 7307 | _x_x_mozilla_page_load_details 11:41:51 INFO - PROCESS | 7307 | |i|pagename|runs| 11:41:51 INFO - PROCESS | 7307 | |0;ai-astar;112;105;110;110;111;111;109;108;111;111 11:41:51 INFO - PROCESS | 7307 | |1;audio-beat-detection;160;124;129;174;126;127;161;127;195;130 11:41:51 INFO - PROCESS | 7307 | |2;audio-dft;161;161;160;160;160;160;160;161;160;161 11:41:51 INFO - PROCESS | 7307 | |3;audio-fft;76;74;75;117;76;75;75;74;103;74 11:41:51 INFO - PROCESS | 7307 | |4;audio-oscillator;86;86;116;85;88;87;120;84;86;129 11:41:51 INFO - PROCESS | 7307 | |5;imaging-gaussian-blur;118;118;117;117;117;116;116;117;116;116 11:41:51 INFO - PROCESS | 7307 | |6;imaging-darkroom;146;146;146;145;147;147;145;146;146;146 11:41:51 INFO - PROCESS | 7307 | |7;imaging-desaturate;96;96;95;96;96;96;96;96;95;95 11:41:51 INFO - PROCESS | 7307 | |8;json-parse-financial;53;53;53;54;52;53;52;54;53;53 11:41:51 INFO - PROCESS | 7307 | |9;json-stringify-tinderbox;61;61;61;61;63;61;62;61;61;61 11:41:51 INFO - PROCESS | 7307 | |10;stanford-crypto-aes;81;81;80;86;85;83;80;81;110;81 11:41:51 INFO - PROCESS | 7307 | |11;stanford-crypto-ccm;139;126;125;137;139;123;138;132;125;141 11:41:51 INFO - PROCESS | 7307 | |12;stanford-crypto-pbkdf2;165;169;162;160;161;165;162;166;161;164 11:41:51 INFO - PROCESS | 7307 | |13;stanford-crypto-sha256-iterative;63;65;64;64;64;63;62;64;64;66 11:41:51 INFO - PROCESS | 7307 | __end_tp_report 11:41:51 INFO - PROCESS | 7307 | __start_cc_report 11:41:51 INFO - PROCESS | 7307 | _x_x_mozilla_cycle_collect,1612 11:41:51 INFO - PROCESS | 7307 | __end_cc_report 11:41:51 INFO - PROCESS | 7307 | __startTimestamp1466534511890__endTimestamp 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | ------- Summary: start ------- 11:41:51 INFO - PROCESS | 7307 | Number of tests: 14 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#0] ai-astar Cycles:10 Average:109.80 Median:111.00 stddev:2.04 (1.8%) stddev-sans-first:2.01 11:41:51 INFO - PROCESS | 7307 | Values: 112.0 105.0 110.0 110.0 111.0 111.0 109.0 108.0 111.0 111.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#1] audio-beat-detection Cycles:10 Average:145.30 Median:145.00 stddev:25.28 (17.4%) stddev-sans-first:26.25 11:41:51 INFO - PROCESS | 7307 | Values: 160.0 124.0 129.0 174.0 126.0 127.0 161.0 127.0 195.0 130.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#2] audio-dft Cycles:10 Average:160.40 Median:160.50 stddev:0.52 (0.3%) stddev-sans-first:0.50 11:41:51 INFO - PROCESS | 7307 | Values: 161.0 161.0 160.0 160.0 160.0 160.0 160.0 161.0 160.0 161.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#3] audio-fft Cycles:10 Average:81.90 Median:75.00 stddev:15.19 (20.3%) stddev-sans-first:15.96 11:41:51 INFO - PROCESS | 7307 | Values: 76.0 74.0 75.0 117.0 76.0 75.0 75.0 74.0 103.0 74.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#4] audio-oscillator Cycles:10 Average:96.70 Median:86.00 stddev:17.54 (20.4%) stddev-sans-first:18.18 11:41:51 INFO - PROCESS | 7307 | Values: 86.0 86.0 116.0 85.0 88.0 87.0 120.0 84.0 86.0 129.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#5] imaging-gaussian-blur Cycles:10 Average:116.80 Median:117.00 stddev:0.79 (0.7%) stddev-sans-first:0.71 11:41:51 INFO - PROCESS | 7307 | Values: 118.0 118.0 117.0 117.0 117.0 116.0 116.0 117.0 116.0 116.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#6] imaging-darkroom Cycles:10 Average:146.00 Median:146.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 11:41:51 INFO - PROCESS | 7307 | Values: 146.0 146.0 146.0 145.0 147.0 147.0 145.0 146.0 146.0 146.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 11:41:51 INFO - PROCESS | 7307 | Values: 96.0 96.0 95.0 96.0 96.0 96.0 96.0 96.0 95.0 95.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#8] json-parse-financial Cycles:10 Average:53.00 Median:53.00 stddev:0.67 (1.3%) stddev-sans-first:0.71 11:41:51 INFO - PROCESS | 7307 | Values: 53.0 53.0 53.0 54.0 52.0 53.0 52.0 54.0 53.0 53.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#9] json-stringify-tinderbox Cycles:10 Average:61.30 Median:61.00 stddev:0.67 (1.1%) stddev-sans-first:0.71 11:41:51 INFO - PROCESS | 7307 | Values: 61.0 61.0 61.0 61.0 63.0 61.0 62.0 61.0 61.0 61.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#10] stanford-crypto-aes Cycles:10 Average:84.80 Median:81.00 stddev:9.09 (11.2%) stddev-sans-first:9.54 11:41:51 INFO - PROCESS | 7307 | Values: 81.0 81.0 80.0 86.0 85.0 83.0 80.0 81.0 110.0 81.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#11] stanford-crypto-ccm Cycles:10 Average:132.50 Median:137.50 stddev:7.09 (5.2%) stddev-sans-first:7.12 11:41:51 INFO - PROCESS | 7307 | Values: 139.0 126.0 125.0 137.0 139.0 123.0 138.0 132.0 125.0 141.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.50 Median:164.50 stddev:2.80 (1.7%) stddev-sans-first:2.92 11:41:51 INFO - PROCESS | 7307 | Values: 165.0 169.0 162.0 160.0 161.0 165.0 162.0 166.0 161.0 164.0 11:41:51 INFO - PROCESS | 7307 | 11:41:51 INFO - PROCESS | 7307 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.90 Median:64.00 stddev:1.10 (1.7%) stddev-sans-first:1.12 11:41:51 INFO - PROCESS | 7307 | Values: 63.0 65.0 64.0 64.0 64.0 63.0 62.0 64.0 64.0 66.0 11:41:51 INFO - PROCESS | 7307 | -------- Summary: end -------- 11:41:51 INFO - PROCESS | 7307 | 11:41:52 INFO - TEST-INFO | 7307: exit 0 11:41:52 INFO - TEST-OK | kraken | took 62568ms 11:41:52 INFO - SUITE-END | took 1178s 11:41:53 INFO - Completed test suite (00:19:38) 11:41:53 INFO - javascript benchmark 11:41:53 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3091.3508163285715, 3124.343887783565, 3140.2934339773556, 3156.6843315668452, 3186.984065079674, 5165.38015438147, 5247.973760131204, 5392.056390131726, 5425.620206585536, 5447.019536483436, 5298.258243845855, 5374.0, 5397.487238712316, 5401.297831281938, 5419.729013549327, 4852.95661432791, 4931.211006239003, 4954.331165292675, 4971.875703107433, 5083.61872859537, 4983.7508124593805, 4992.301077849104, 5016.598672106223, 5039.0, 5059.3422855028975, 4796.040791841629, 4808.711477311373, 4816.614670826326, 4840.491748366406, 4847.49101344359, 4779.689320194211, 4811.350467686852, 4888.315635810989, 4901.681390709592, 4917.50824917509, 4860.198067318924, 4874.46380898101, 4875.122477953967, 4941.283513890502, 4944.653874228806, 5220.3735551734035, 5246.422893481714, 5273.683578985273, 5379.139337705988, 5435.945640543623, 5925.466707996258, 5943.3462319144855, 5944.762209511614, 5945.464908158243, 5947.434993675594, 5899.1446240295345, 5936.406359364072, 5952.494038006775, 5955.940440595626, 5974.4324289192455, 5300.284461597712, 5354.973225133849, 5395.892082158335, 5404.540614047772, 5509.669419834822, 5898.056310990221, 5904.61619994699, 5957.4638282553915, 5966.612170208922, 5972.492338151219, 5729.427057294321, 5736.77052917887, 5737.540996720252, 5752.165935939349, 5757.136429535603, 5555.111182210908, 5720.456556627114, 5769.624974376652, 5770.88458230833, 5801.390853960358, 5741.913871291934, 5774.2782152230975, 5775.884482310415, 5785.82642520725, 5793.073108302651, 5553.1670249462095, 5720.456556627114, 5757.395473475225, 5778.27771528559, 5781.479666830005, 4290.0, 4329.588689074533, 4343.522212556616, 4350.477942646902, 4412.911741765147, 3893.5717071122153, 3913.8238779255003, 3916.236333914916, 3949.2101579684177, 3964.8414063437717, 5428.511433970962, 5433.864153396196, 5439.238506609078, 5439.966406382775, 5442.782288708408, 5582.553395728332, 5686.3744988051285, 5745.2818397700285, 5754.136879468029, 5769.249997500298, 5459.863503412446, 5464.781408743605, 5466.125419932791, 5468.9726551367785, 5469.671819690831, 4867.488913664014, 4984.825531106394, 4992.051510213048, 5002.97439024999, 5047.369078865142, 5927.288725352899, 6028.788992385245, 6044.123602077762, 6070.514358851281, 6075.210222671201, 5855.560832937462, 5862.501687356452, 5863.589548731547, 5866.090755932837, 5866.823995280149, 5680.886382272249, 5834.504067154339, 6055.576109672281, 6060.363661815446, 6066.272047354346, 5522.3649280333275, 5584.664920104807, 5621.550275977994, 5629.971850140887, 5636.718164091697, 5568.136938774496, 5658.349289831557, 5665.3201615806365, 5683.090705487102, 5712.685802280915, 5544.61187716856, 5577.470140336662, 5586.217929489793, 5589.972050139723, 5598.664080155204, 5641.915371269352, 5682.346530149086, 5697.54419646419, 5732.340780810094, 5735.9139612905, 5609.1305847593685, 5609.719514024364, 5613.158026296088, 5613.382527922007, 5614.52276556481, 5496.230527726201, 5555.555555555465, 5747.4252574742195, 5806.042003069446, 5814.622049566765, 5500.367457742411, 5559.138333558305, 5560.110382338807, 5561.749721262472, 5613.0], "value": 5320.915040472212, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [579.7159391897972, 584.8303991842366, 607.6931149769366, 609.3845216331504, 619.857432790458, 30542.38915221697, 42483.78758106209, 43321.0, 43694.0, 43702.7814860926, 43115.137697246035, 45130.77434612822, 45177.09645807082, 45294.773526132405, 45339.639810805646, 8179.836403271931, 8815.074417186199, 8971.910280897173, 10611.734706632358, 10876.293040952352, 10732.839007414896, 10798.298110622824, 10798.838017429705, 10813.459327033655, 10820.296680715768, 10727.731806704816, 10778.353298802096, 10782.0, 10811.83782243263, 10836.945815270912, 10699.144068474543, 10745.194110441747, 10764.24650274481, 10768.407737574431, 10827.67516974492, 10584.629537966212, 10691.679249622524, 10722.571097156104, 10733.570657173703, 10742.086922611586, 41402.37896431556, 41732.0, 41810.0, 41810.37284440736, 41911.0, 3249.658785827478, 3267.3465306938706, 3448.189675426273, 3791.6777073948747, 4094.897627559335, 32021.519677204862, 32037.359252815048, 32641.51037734436, 32859.83570082158, 33603.0, 4302.9569704303185, 4353.216421044211, 4396.516383197845, 4396.956030439686, 4465.129299786543, 321026.0, 322540.0, 325549.0, 325840.3707981469, 326002.0, 57544.42455575475, 57981.71009144927, 57997.42002580005, 58225.417745822844, 58493.70753146207, 61588.69205653943, 61655.69172154111, 61684.0, 61908.38091619116, 61980.69009654923, 13225.537106201236, 13317.533886313933, 13331.333433328295, 13334.933325333504, 13362.599122026355, 12073.396330183456, 12166.330851803235, 12173.817392739116, 12174.756504869853, 12189.085818563466, 6497.545171838021, 7896.763097107096, 8184.263416292562, 8197.426180167451, 8361.080281169066, 7097.361237488651, 7117.928820711727, 7122.219445138715, 7326.633668316563, 7333.559986400833, 930.7812664023949, 982.6069572171189, 989.569537251298, 1019.6991887393236, 1039.0804138337473, 33046.8347658265, 33382.66617333796, 33735.15662108418, 33805.0, 34251.82874085614, 1071.8231491803922, 1152.193464574801, 1152.3949926288765, 1156.653004098767, 1161.5528021711702, 17178.484645460405, 17457.0, 17543.91228043877, 17555.648887022187, 17599.73600395995, 521002.0, 521771.0, 522568.0, 523696.0, 531645.0, 58296.4170358291, 59699.40300596938, 60095.59139677363, 60114.086880008486, 60119.699401502716, 1135.6593022093339, 1269.828573142614, 1303.387407918277, 1325.5890673891124, 1328.7276108397755, 29398.0, 30626.540601890545, 30966.845165774026, 31081.689183108785, 31540.211494712818, 49131.26303105528, 49184.75407622939, 49442.75278623584, 49941.25088123754, 50248.497515024384, 387889.0, 398468.0, 398704.0, 400659.0, 400740.0, 26835.463290734468, 28443.573346400233, 28906.27734306659, 29237.41525169527, 29509.409811803213, 44644.77677611591, 47742.94184994314, 48243.75878120587, 48819.26771098508, 49334.0, 34919.476207856394, 35231.82384088063, 35302.0, 35536.0, 35550.64449355473, 33908.15229619279, 34384.656153439144, 34403.31193376169, 34447.31105377928, 34744.82627586846, 36153.638463615025, 36233.81883090568, 36961.0, 37026.62973370232, 37181.81409092937, 35541.0, 35562.64437355593, 36675.633243667224, 36902.0, 37129.0, 27541.449171016066, 27908.30229244204, 28301.57547636828, 28316.0, 28320.0], "value": 19570.151646977614, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [374.9164913400273, 383.73522269633935, 392.98231579578913, 403.09304065851836, 403.3304714174471, 17391.826081739193, 19339.90330048348, 19405.611887762254, 19858.801411985893, 19868.105935232914, 18136.274549018057, 18249.36127235547, 18922.959237241947, 19324.227030918748, 19597.314094006713, 5580.6372585782, 5581.832545023656, 5823.0, 5837.066069428893, 5838.124281357809, 5655.3779084300695, 5706.258186435778, 5724.34170070441, 5782.653040817543, 5783.942160578404, 5472.50747432731, 5619.9884020876225, 5691.117876729114, 5694.857628559298, 5695.373508914037, 5654.74553645087, 5654.886902261932, 5675.063614503602, 5698.7435565399655, 5698.857528561778, 4999.175136102539, 5030.4215015272985, 5050.898982020376, 5061.873453163664, 5086.949130508721, 22254.109835606556, 22324.665130023062, 22513.662295065587, 23193.188238411574, 23213.0, 2319.7100362454694, 2365.5150694107665, 2506.572657743777, 2633.644457998165, 2647.7617014468597, 14293.285335733275, 14310.713785724227, 14433.422663093568, 14590.343434545472, 14866.033707809065, 1897.193692680619, 1909.5703466720015, 1947.9026048697508, 2012.8993550322425, 2027.108072448118, 79995.0, 80056.59971700162, 80128.0, 81667.0, 82231.58884205601, 10188.184945204366, 10239.948800255952, 10522.473876306154, 10707.30402523849, 10759.0, 14861.777073343908, 14924.283707373574, 14943.327550260265, 14946.402143914122, 14974.401023959137, 7566.394688424913, 7845.254700803414, 7887.0, 7960.960195198987, 7968.402369822171, 7487.625618719042, 7626.0, 7652.120006199247, 7679.155292917774, 7829.334506566892, 6474.223093228843, 6527.82499150148, 6586.176727909012, 6613.966930165318, 6625.635590042594, 1883.5761953560338, 1889.914953827081, 1893.4603637963114, 1903.0, 1904.419152158605, 954.4511905654276, 1022.2946167144646, 1041.6406339812752, 1068.5191663751189, 1108.7505311304892, 18466.907665461586, 19973.500662483555, 20965.68551471729, 20982.160713571593, 21029.15883364648, 953.699584630839, 962.5283611030544, 985.4973963278779, 986.6053578568486, 998.8751406074241, 10767.138628909668, 11073.50169242386, 11229.887701123047, 11352.602658906899, 11415.143864210217, 487443.0, 490493.0, 496868.0, 531482.1110733368, 540425.0, 91894.54052729694, 94850.52574737082, 96885.0, 96965.0, 96965.0303496956, 1002.293383164867, 1015.7968406318765, 1036.4558606731525, 1041.671873359889, 1042.6976176908915, 16535.421260256313, 17372.305107795546, 17733.822661773218, 18097.0, 18114.27542898269, 42743.786281068395, 42795.6112166635, 43655.34516982184, 43795.12409751723, 44318.556814431446, 55497.1675424877, 57484.71257643685, 57709.13436298375, 58378.4162158373, 58551.70724146352, 8424.368172386972, 8638.82722345537, 8822.691205807765, 8864.379493435397, 8930.240929520804, 10185.388876667424, 13381.126642269895, 13614.591562253148, 13739.931300343434, 14110.50613228532, 11249.381284029458, 11965.461554229907, 12015.219010764273, 12230.510779569073, 12412.75174496487, 11625.767484650429, 11823.586174483851, 12017.278963262232, 12058.819117713067, 12125.393730313626, 11479.311241325548, 12123.75752484963, 12274.202176858476, 12320.75358492843, 12891.0, 7129.322714342129, 8546.871796922927, 8710.956445217733, 8959.0, 8979.326550508607, 9799.85300220483, 11364.374959377314, 11726.472308746297, 12230.205036672587, 12487.0], "value": 9410.2209802724, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1230.661568068781, 1246.414185332893, 1319.2809918594364, 1364.9830875997382, 1489.6797188604455, 8285.54429506377, 8655.177758112985, 8677.522736249504, 8907.28741700664, 8922.241609463203, 8676.913230867689, 8683.522406267653, 8759.693410730626, 8767.780805479866, 8777.253933415652, 2250.2686626846257, 2281.3954302109955, 2284.2804516577307, 2285.165914441225, 2287.142321629389, 2235.485838257202, 2251.0320562158267, 2318.8956496957676, 2320.164740693349, 2323.9535209295805, 2291.186628746796, 2312.5721741477796, 2316.108298305148, 2320.8143348532076, 2330.0446816805115, 2230.230570453191, 2258.836699099965, 2261.378121016717, 2262.988685056581, 2266.263464374085, 2266.3654176830514, 2268.557631261888, 2273.4202778291597, 2274.8407611467205, 2276.3853759485014, 8614.56927153646, 8729.0, 8772.210501054935, 8778.47329160246, 8795.032546419889, 4985.675931064469, 5168.3281173447585, 5177.870553236199, 5180.0, 5191.169412893919, 3249.528818321354, 3366.377220214268, 3422.828858557062, 3433.141714571357, 3445.810480423576, 1165.5862168930078, 1192.4991503568522, 1217.6834023153956, 1229.8524177098716, 2154.644483660194, 11877.0, 12314.630561083091, 12325.445354959138, 12338.444769985372, 12344.567940122053, 4252.298370768788, 4424.513303536608, 4439.4006809080365, 4498.797554110073, 4509.819607215741, 9629.518524073768, 9695.660651877291, 9714.125728684452, 9720.708378748648, 9733.270004749673, 4889.315495830587, 4917.409910810726, 4939.777710003059, 4967.850964471072, 4970.179920313108, 4078.490188726409, 4234.364845273172, 4611.631069514431, 4627.9074418511445, 4726.95273047272, 3644.7630903991158, 3647.7993710346186, 3668.6514781095752, 3698.1863989922176, 3728.925421491555, 1072.6996440996534, 1086.750047489082, 1087.7226307291749, 1088.0207812968392, 1104.6354702948008, 857.4983634573845, 861.4960248254716, 990.5691024404407, 999.020959459719, 1009.1523120578603, 5812.767489300465, 6069.180660610849, 6131.938680613226, 6200.410960958701, 6319.778807741707, 431.78195011518983, 436.8230866499073, 441.5099239843771, 446.98212071516775, 448.0434272827472, 4106.597640380352, 4247.129338485603, 4290.549492303326, 4326.091520780671, 4326.4159338489535, 10652.573897044187, 10666.78666426667, 11003.504842282116, 11060.115190784718, 11093.057090147266, 10833.187510936554, 10913.945430272957, 10977.176711746652, 10979.451027448597, 11050.944745276222, 8186.959065204755, 8231.876521852177, 8263.297619702273, 8280.461769984931, 8330.458520196167, 5847.38602446737, 5913.432940270745, 5990.910136348046, 6152.077188421773, 6349.269833969152, 9508.191803696764, 9938.509223616515, 9972.0, 10047.949760251153, 10094.394336339843, 10074.294799364267, 10228.437435941094, 10324.07083362501, 10405.531751071372, 10420.68737937863, 7183.604901730455, 7330.157031941395, 7514.736984205527, 7556.357709594746, 7708.49894756839, 8299.419040667337, 8324.875126873223, 8344.207300306462, 8405.453645513267, 8406.621702023302, 7739.458237923292, 7740.071191456836, 7821.648025838737, 7892.289693927574, 7932.6033698316005, 7073.292670733092, 7302.196758356683, 7311.817204569928, 7570.621468926422, 7770.3395211405405, 6911.067005954132, 7001.859962800817, 7006.334398232159, 7063.0, 7070.893936590853, 5117.8720531987, 5217.50433708797, 5217.8173763918085, 5300.469953004823, 5441.183822426668, 4965.528274813887, 5331.680099194061, 5339.919901201408, 5356.544693701079, 5434.728263586726], "value": 4482.147304950139, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [306.16569847166477, 309.9411111888741, 315.8468142950669, 324.71262932304904, 329.1573571656559, 5215.843524694265, 5402.648827826199, 5439.864003399917, 5475.589330800191, 5502.80740174094, 5350.35795704515, 5363.793146542036, 5420.696204113256, 5438.864028399292, 5472.753726082326, 4172.144710334374, 4186.330187170053, 4195.181939521794, 4215.978920105395, 4220.788960551968, 3889.747166434187, 4087.976451656419, 4219.156168766243, 4238.088810905655, 4246.087091275375, 4149.688773342012, 4183.979080104596, 4191.637717741746, 4206.432131662233, 4208.2845916194165, 4171.436856024428, 4171.541130475661, 4227.429297044921, 4253.851115210984, 4277.764722940237, 3675.9816200918826, 3721.5162028936065, 3751.4185301278344, 3764.4541541476333, 3770.5852356240794, 5201.843944681666, 5211.0, 5212.462323614543, 5258.894822103574, 5261.3686357637325, 4768.189407800683, 4788.904221915577, 4796.472388037348, 4803.615710743132, 4811.4707382187935, 5444.7822087116465, 5671.943280567183, 5709.800156994527, 5712.1435533451795, 5714.542836573064, 4049.7772622506045, 4063.918721625551, 4063.9796801015805, 4085.20338533986, 4093.9385909211387, 5880.26496687914, 5882.588218824684, 5900.527957763368, 5908.0, 5929.73316200772, 4048.3117869962175, 4132.607402296777, 4153.813078411479, 4160.439835061852, 4170.124273902454, 4188.874333769992, 4197.433346498245, 4204.117135401539, 4209.5579964103945, 4219.008532994744, 4788.640851936049, 4791.377120974251, 4794.664373493892, 4819.421669399624, 4821.143859614074, 5581.581381396411, 5677.545796336366, 5754.88490230193, 5755.8273251801675, 5771.134329850472, 1388.7500249954903, 1413.6395219219032, 1438.96402589934, 1471.2864260833487, 1473.8010368600317, 917.9678711245074, 930.6556574067638, 931.2736065868634, 937.9859302110474, 950.7022913722718, 4900.730459824744, 4910.533499317559, 4916.237983112624, 4933.358663373739, 4952.380952380952, 5147.382314122255, 5157.948420515747, 5190.6107041971245, 5214.374275087014, 5215.921761173586, 4616.699914505546, 4866.902661946741, 4870.537298956593, 4898.706077635354, 4901.485344038896, 2705.3371923878776, 2734.2890848379566, 2736.480068786924, 2751.4866823247135, 2752.9174124776287, 5167.354080739908, 5212.983468223736, 5229.320188375486, 5251.52736253739, 5269.919666468365, 4862.270659401118, 5185.766640501187, 5194.532492075731, 5195.19474481456, 5255.08036093682, 5258.8948221036135, 5262.500062494057, 5292.576593872481, 5298.576113910955, 5302.621318457152, 5128.615353848401, 5174.62872338838, 5182.548886311839, 5187.688738675692, 5235.345581802275, 4759.571638552547, 5062.392512898476, 5072.847814565569, 5105.4384017757275, 5119.590432765444, 5225.764840582106, 5308.823382413192, 5350.4382039886805, 5370.301860758076, 5394.811181608625, 3791.507104076563, 3831.8658846940225, 3872.7482713623526, 3883.9223215536094, 3896.454496370454, 4920.810239443414, 5214.4617337886175, 5300.178472336794, 5590.329160500766, 5619.297587801525, 5652.5477961762135, 5698.808667146412, 5704.458076482728, 5720.313562372542, 5754.971225143848, 5632.295963004624, 5665.801696940587, 5686.886262274814, 5711.257536520226, 5725.341585717696, 5467.371252305877, 5546.766216330863, 5588.944110558842, 5613.46672066153, 5634.267545219095, 5651.406602306863, 5757.136429535603, 5766.279215098113, 5768.278965129359, 5772.365039845529, 5440.0, 5584.804531841366, 5591.720413979204, 5646.407127251579, 5675.772969081356], "value": 4153.805913273593, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [701.2216439751875, 734.8016035670369, 769.9404094048421, 780.7189411811743, 817.5094943034178, 14471.638209044779, 15290.31193596288, 15472.071675699437, 15515.612109697264, 15647.061176329427, 13473.73052538951, 13567.864321356783, 13573.660658483543, 13583.252921089335, 13624.046316757831, 634.5431289471574, 726.0923845193508, 773.161120184599, 781.4451739265129, 784.6273020315361, 780.7228433905967, 787.7676085554747, 788.0897563314353, 789.03737440323, 789.5026133535864, 816.7876352148454, 831.7255305749119, 833.4499230507867, 833.6165363932598, 834.1200033964166, 677.0791723256367, 758.8254701418705, 833.8374017066675, 834.3033566971586, 837.4347315562002, 582.1035605168037, 590.9143174239712, 602.1449541650823, 605.1618508365945, 606.9241344831896, 14057.5079872205, 14091.577252682437, 14105.083169593943, 14148.92925535376, 14152.716945661132, 13688.0, 14375.353109110116, 14381.44814981755, 14532.0, 14671.33978970949, 13088.149270297401, 13132.803007954888, 13324.533641322603, 13353.933230333787, 13716.0, 4447.155040542287, 4467.553244675539, 4503.4145561077175, 4644.280136578802, 4690.882727931795, 75589.0, 75999.99999999945, 76053.0, 76399.0, 76790.61604691941, 10578.52396642153, 10674.573017079385, 11017.504212310465, 11021.0, 11416.771664566662, 19957.20171193136, 19957.800421995595, 19966.70049949252, 19974.0, 19978.70031949522, 7619.69521219145, 7817.257360550739, 7971.242731940456, 8015.238552337519, 8032.0, 4427.623651989553, 4475.507694153641, 4569.520200378979, 4646.605038571759, 4651.767411629405, 3348.079278198466, 3471.0801637566065, 3478.599961004517, 3480.634533373959, 3496.8076755778675, 549.6976662835425, 566.4618612318314, 569.5272923473507, 582.5019608234899, 602.2682440834408, 525.8422473258007, 566.2242727463401, 594.482799964034, 656.3305428462941, 675.3617831149614, 8021.27808497238, 8778.868316975251, 8960.641574337084, 9084.81830363389, 9147.0, 599.6641880546821, 607.9209702738616, 618.8669436071176, 632.8069938668658, 658.509410489179, 4309.41822853917, 4316.6330861877095, 4339.934900976488, 4409.426774519292, 4504.48198457175, 107654.0, 109441.71674849767, 110169.0, 113174.43412782883, 115015.0, 96486.0, 96625.5168724166, 96759.51620241854, 97212.51393742986, 99055.0, 85066.0, 86008.56995714981, 87171.0, 88293.11706882977, 89376.0, 8133.735760492838, 8139.4709343892455, 8354.16458354184, 8402.453840500348, 8414.3268538518, 48803.0, 50635.0, 50997.7450112747, 51947.48052519427, 52827.47172528225, 66863.66568167128, 67440.6627966857, 74821.62589187238, 76337.0, 76785.85713143047, 10561.735956601147, 10593.09958653523, 10825.837612435977, 10908.400037997986, 10997.945010274898, 11636.301821890713, 11739.23694959825, 12278.631641050782, 12354.876451235732, 12405.13164078542, 11619.0, 11862.525498979945, 11882.58410955647, 12089.0, 12235.0, 10982.395968221825, 11770.470328835052, 11968.820467692818, 12407.007439405006, 12743.49026038948, 11630.825537616773, 11728.237664552118, 11752.0, 11786.823197651871, 11936.788310302842, 9254.722358329262, 9314.161725444743, 9419.952900235456, 9499.857502137334, 9509.334346595671, 9393.436393816393, 9593.28050396237, 9603.9039609603, 9662.903370966482, 9725.610975561181], "value": 7097.342729462437, "unit": "score"}], "name": "dromaeo_css", "value": 7112.830298231107, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 105.0, 110.0, 110.0, 111.0, 111.0, 109.0, 108.0, 111.0, 111.0], "value": 109.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 124.0, 129.0, 174.0, 126.0, 127.0, 161.0, 127.0, 195.0, 130.0], "value": 145.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 160.0, 160.0, 160.0, 160.0, 160.0, 161.0, 160.0, 161.0], "value": 160.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 74.0, 75.0, 117.0, 76.0, 75.0, 75.0, 74.0, 103.0, 74.0], "value": 81.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 86.0, 116.0, 85.0, 88.0, 87.0, 120.0, 84.0, 86.0, 129.0], "value": 96.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 117.0, 117.0, 117.0, 116.0, 116.0, 117.0, 116.0, 116.0], "value": 116.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 145.0, 147.0, 147.0, 145.0, 146.0, 146.0, 146.0], "value": 146.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0, 95.0], "value": 95.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 53.0, 53.0, 54.0, 52.0, 53.0, 52.0, 54.0, 53.0, 53.0], "value": 53.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 61.0, 61.0, 61.0, 63.0, 61.0, 62.0, 61.0, 61.0, 61.0], "value": 61.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 81.0, 80.0, 86.0, 85.0, 83.0, 80.0, 81.0, 110.0, 81.0], "value": 84.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 126.0, 125.0, 137.0, 139.0, 123.0, 138.0, 132.0, 125.0, 141.0], "value": 132.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 169.0, 162.0, 160.0, 161.0, 165.0, 162.0, 166.0, 161.0, 164.0], "value": 163.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 65.0, 64.0, 64.0, 64.0, 63.0, 62.0, 64.0, 64.0, 66.0], "value": 63.9, "unit": "score"}], "name": "kraken", "value": 1511.6000000000001, "alertThreshold": 2.0}]} 11:41:53 INFO - Return code: 0 11:41:53 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:41:53 INFO - # TBPL SUCCESS # 11:41:53 INFO - Running post-action listener: _resource_record_post_action 11:41:53 INFO - ##### 11:41:53 INFO - ##### Finished run-tests step (success) 11:41:53 INFO - ##### 11:41:53 INFO - Running post-run listener: _resource_record_post_run 11:41:53 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 0; Write bytes: 304340992; Read time: 0; Write time: 281028 11:41:53 INFO - TinderboxPrint: CPU usage
13.3% 11:41:53 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 11:41:53 INFO - TinderboxPrint: I/O write bytes / time
304,340,992 / 281,028 11:41:53 INFO - TinderboxPrint: CPU idle
8,282.7 (86.7%) 11:41:53 INFO - TinderboxPrint: CPU user
1,218.1 (12.8%) 11:41:53 INFO - TinderboxPrint: Swap in / out
0 / 0 11:41:53 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 14327808; Read time: 0; Write time: 7904 11:41:53 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 0; Write bytes: 290013184; Read time: 0; Write time: 273124 11:41:53 INFO - Running post-run listener: _upload_blobber_files 11:41:53 INFO - Blob upload gear active. 11:41:53 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:41:53 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 11:41:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:41:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:41:54 INFO - (blobuploader) - INFO - Open directory for files ... 11:41:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:41:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:41:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:41:58 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:41:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:41:58 INFO - (blobuploader) - INFO - Done attempting. 11:41:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 11:41:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:41:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:41:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:41:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:41:58 INFO - (blobuploader) - INFO - Done attempting. 11:41:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:41:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:41:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:41:59 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:41:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:41:59 INFO - (blobuploader) - INFO - Done attempting. 11:41:59 INFO - (blobuploader) - INFO - Iteration through files over. 11:41:59 INFO - Return code: 0 11:41:59 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:41:59 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:41:59 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8275c100cbaf1d090c3f3a9f664a38de1d5b4046e91014d94857597bc205c5bc316aae07d6de7d891556c7091257165a8e5fb0fd484d0bd0f23f37276fae7637", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9e204ea92905eba97b6295afedada3040c4b6f4f040e128c7c8cab8054548dbd4b35f8794cec0565925225e0cd8e00a73fe31dda4e50df80f23577b8a09fc792", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/65e570d7227fe20a527f0837b65bee18d244a0956f699cc3a3cb8ae4ea759719b76026ef338d4230c21dce6ebd38d278686aaf9d87e8ed03a74ba589e8892994"} 11:41:59 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:41:59 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:41:59 INFO - Contents: 11:41:59 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8275c100cbaf1d090c3f3a9f664a38de1d5b4046e91014d94857597bc205c5bc316aae07d6de7d891556c7091257165a8e5fb0fd484d0bd0f23f37276fae7637", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9e204ea92905eba97b6295afedada3040c4b6f4f040e128c7c8cab8054548dbd4b35f8794cec0565925225e0cd8e00a73fe31dda4e50df80f23577b8a09fc792", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/65e570d7227fe20a527f0837b65bee18d244a0956f699cc3a3cb8ae4ea759719b76026ef338d4230c21dce6ebd38d278686aaf9d87e8ed03a74ba589e8892994"} 11:41:59 INFO - Running post-run listener: copy_logs_to_upload_dir 11:41:59 INFO - Copying logs to upload dir... 11:41:59 INFO - mkdir: /builds/slave/test/build/upload/logs 11:41:59 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1433.925858 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 23 mins, 53 secs) (at 2016-06-21 11:41:59.622727) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-21 11:41:59.626645) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8275c100cbaf1d090c3f3a9f664a38de1d5b4046e91014d94857597bc205c5bc316aae07d6de7d891556c7091257165a8e5fb0fd484d0bd0f23f37276fae7637", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9e204ea92905eba97b6295afedada3040c4b6f4f040e128c7c8cab8054548dbd4b35f8794cec0565925225e0cd8e00a73fe31dda4e50df80f23577b8a09fc792", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/65e570d7227fe20a527f0837b65bee18d244a0956f699cc3a3cb8ae4ea759719b76026ef338d4230c21dce6ebd38d278686aaf9d87e8ed03a74ba589e8892994"} build_url:https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011512 build_url: 'https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8275c100cbaf1d090c3f3a9f664a38de1d5b4046e91014d94857597bc205c5bc316aae07d6de7d891556c7091257165a8e5fb0fd484d0bd0f23f37276fae7637", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9e204ea92905eba97b6295afedada3040c4b6f4f040e128c7c8cab8054548dbd4b35f8794cec0565925225e0cd8e00a73fe31dda4e50df80f23577b8a09fc792", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/65e570d7227fe20a527f0837b65bee18d244a0956f699cc3a3cb8ae4ea759719b76026ef338d4230c21dce6ebd38d278686aaf9d87e8ed03a74ba589e8892994"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-21 11:41:59.651328) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:41:59.651615) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1466533025.164603-432976079 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004501 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:41:59.733826) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-21 11:41:59.734109) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-21 11:41:59.734376) ========= ========= Total master_lag: 0.17 =========