builder: mozilla-aurora_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0128 starttime: 1474638942.03 results: success (0) buildid: 20160923055359 builduid: 581dab9710d3440db91f95dc7eeb90a1 revision: 4dd6247f67104db93b1a495aacb2cf5410a62af1 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:42.026844) ========= master: http://buildbot-master134.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:42.027426) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:42.027711) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:42.119250) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:42.119509) ========= 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: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners TMPDIR=/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-09-23 06:55:42-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 170M=0s 2016-09-23 06:55:42 (170 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.487844 ========= master_lag: 0.07 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:42.679836) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:42.680162) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners TMPDIR=/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.020858 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:42.765177) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-23 06:55:42.765486) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 4dd6247f67104db93b1a495aacb2cf5410a62af1 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 4dd6247f67104db93b1a495aacb2cf5410a62af1 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners TMPDIR=/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-09-23 06:55:42,842 truncating revision to first 12 chars 2016-09-23 06:55:42,842 Setting DEBUG logging. 2016-09-23 06:55:42,842 attempt 1/10 2016-09-23 06:55:42,842 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/4dd6247f6710?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-23 06:55:44,015 unpacking tar archive at: mozilla-aurora-4dd6247f6710/testing/mozharness/ program finished with exit code 0 elapsedTime=1.435291 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-23 06:55:44.223127) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:44.223407) ========= script_repo_revision: 4dd6247f67104db93b1a495aacb2cf5410a62af1 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:44.223798) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:44.224070) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-23 06:55:44.242300) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-09-23 06:55:44.242611) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners TMPDIR=/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 06:55:44 INFO - MultiFileLogger online at 20160923 06:55:44 in /builds/slave/test 06:55:44 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 06:55:44 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:55:44 INFO - {'append_to_log': False, 06:55:44 INFO - 'base_work_dir': '/builds/slave/test', 06:55:44 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 06:55:44 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:55:44 INFO - 'branch': 'Mozilla-Aurora', 06:55:44 INFO - 'buildbot_json_path': 'buildprops.json', 06:55:44 INFO - 'config_files': ('talos/mac_config.py',), 06:55:44 INFO - 'default_actions': ('clobber', 06:55:44 INFO - 'read-buildbot-config', 06:55:44 INFO - 'download-and-extract', 06:55:44 INFO - 'populate-webroot', 06:55:44 INFO - 'create-virtualenv', 06:55:44 INFO - 'install', 06:55:44 INFO - 'run-tests'), 06:55:44 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:55:44 INFO - 'download_minidump_stackwalk': True, 06:55:44 INFO - 'download_symbols': 'ondemand', 06:55:44 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:55:44 INFO - 'tooltool.py': '/tools/tooltool.py', 06:55:44 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:55:44 INFO - '/tools/misc-python/virtualenv.py')}, 06:55:44 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:55:44 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:55:44 INFO - 'installer_path': 'installer.exe', 06:55:44 INFO - 'log_level': 'info', 06:55:44 INFO - 'log_name': 'talos', 06:55:44 INFO - 'log_to_console': True, 06:55:44 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 06:55:44 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 06:55:44 INFO - 'opt_config_files': (), 06:55:44 INFO - 'pip_index': False, 06:55:44 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 06:55:44 INFO - 'cmd': ('bash', 06:55:44 INFO - '-c', 06:55:44 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 06:55:44 INFO - 'enabled': True, 06:55:44 INFO - 'halt_on_failure': False, 06:55:44 INFO - 'name': 'check_screen_resolution'},), 06:55:44 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 06:55:44 INFO - 'cmd': ('bash', 06:55:44 INFO - '-c', 06:55:44 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 06:55:44 INFO - 'enabled': True, 06:55:44 INFO - 'halt_on_failure': False, 06:55:44 INFO - 'name': 'check_screen_resolution'},), 06:55:44 INFO - 'run_cmd_checks_enabled': True, 06:55:44 INFO - 'sps_profile': False, 06:55:44 INFO - 'sps_profile_interval': 0, 06:55:44 INFO - 'suite': 'dromaeojs-e10s', 06:55:44 INFO - 'system_bits': '32', 06:55:44 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:55:44 INFO - 'title': 't-yosemite-r7-0128', 06:55:44 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:55:44 INFO - 'use_talos_json': True, 06:55:44 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:55:44 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:55:44 INFO - 'work_dir': 'build'} 06:55:44 INFO - [mozharness: 2016-09-23 13:55:44.440894Z] Running clobber step. 06:55:44 INFO - Running pre-action listener: _resource_record_pre_action 06:55:44 INFO - Running main action method: clobber 06:55:44 INFO - rmtree: /builds/slave/test/build 06:55:44 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:55:45 INFO - Running post-action listener: _resource_record_post_action 06:55:45 INFO - [mozharness: 2016-09-23 13:55:45.333643Z] Finished clobber step (success) 06:55:45 INFO - [mozharness: 2016-09-23 13:55:45.333777Z] Running read-buildbot-config step. 06:55:45 INFO - Running pre-action listener: _resource_record_pre_action 06:55:45 INFO - Running main action method: read_buildbot_config 06:55:45 INFO - Using buildbot properties: 06:55:45 INFO - { 06:55:45 INFO - "project": "", 06:55:45 INFO - "product": "firefox", 06:55:45 INFO - "script_repo_revision": "production", 06:55:45 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs-e10s", 06:55:45 INFO - "repository": "", 06:55:45 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs-e10s", 06:55:45 INFO - "buildid": "20160923055359", 06:55:45 INFO - "pgo_build": "False", 06:55:45 INFO - "basedir": "/builds/slave/test", 06:55:45 INFO - "buildnumber": 92, 06:55:45 INFO - "slavename": "t-yosemite-r7-0128", 06:55:45 INFO - "master": "http://buildbot-master134.bb.releng.scl3.mozilla.com:8201/", 06:55:45 INFO - "platform": "yosemite_r7", 06:55:45 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 06:55:45 INFO - "branch": "mozilla-aurora", 06:55:45 INFO - "repo_path": "releases/mozilla-aurora", 06:55:45 INFO - "revision": "4dd6247f67104db93b1a495aacb2cf5410a62af1", 06:55:45 INFO - "stage_platform": "macosx64", 06:55:45 INFO - "builduid": "581dab9710d3440db91f95dc7eeb90a1", 06:55:45 INFO - "slavebuilddir": "test" 06:55:45 INFO - } 06:55:45 INFO - Found installer url https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg. 06:55:45 INFO - Running post-action listener: _resource_record_post_action 06:55:45 INFO - [mozharness: 2016-09-23 13:55:45.337173Z] Finished read-buildbot-config step (success) 06:55:45 INFO - [mozharness: 2016-09-23 13:55:45.337298Z] Running download-and-extract step. 06:55:45 INFO - Running pre-action listener: _resource_record_pre_action 06:55:45 INFO - Running main action method: download_and_extract 06:55:45 INFO - mkdir: /builds/slave/test/build/tests 06:55: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:55:45 INFO - trying https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json 06:55:45 INFO - Downloading https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 06:55:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json'}, attempt #1 06:55:45 INFO - Downloaded 1199 bytes. 06:55:45 INFO - Reading from file /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 06:55:45 INFO - Using the following test package requirements: 06:55:45 INFO - {u'common': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 06:55:45 INFO - u'cppunittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 06:55:45 INFO - u'firefox-51.0a2.en-US.mac.cppunittest.tests.zip'], 06:55:45 INFO - u'gtest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 06:55:45 INFO - u'firefox-51.0a2.en-US.mac.gtest.tests.zip'], 06:55:45 INFO - u'jittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 06:55:45 INFO - u'jsshell-mac.zip'], 06:55:45 INFO - u'mochitest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 06:55:45 INFO - u'firefox-51.0a2.en-US.mac.mochitest.tests.zip'], 06:55:45 INFO - u'mozbase': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 06:55:45 INFO - u'reftest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 06:55:45 INFO - u'firefox-51.0a2.en-US.mac.reftest.tests.zip'], 06:55:45 INFO - u'talos': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 06:55:45 INFO - u'firefox-51.0a2.en-US.mac.talos.tests.zip'], 06:55:45 INFO - u'web-platform': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 06:55:45 INFO - u'firefox-51.0a2.en-US.mac.web-platform.tests.zip'], 06:55:45 INFO - u'xpcshell': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 06:55:45 INFO - u'firefox-51.0a2.en-US.mac.xpcshell.tests.zip']} 06:55:45 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip'] for test suite category: common 06:55:45 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 06:55:45 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 06:55:45 INFO - Fetch https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 06:55:46 INFO - Expected file size: 16426469 06:55:53 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip', u'firefox-51.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 06:55:53 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 06:55:53 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 06:55:53 INFO - Fetch https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 06:55:53 INFO - Expected file size: 16426469 06:56:00 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip 06:56:00 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip'}, attempt #1 06:56:00 INFO - Fetch https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip into memory 06:56:01 INFO - Expected file size: 14414059 06:56:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:02 INFO - trying https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 06:56:02 INFO - Downloading https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg 06:56:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg'}, attempt #1 06:56:08 INFO - Downloaded 115243958 bytes. 06:56:08 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 06:56:08 INFO - mkdir: /builds/slave/test/properties 06:56:08 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:56:08 INFO - Writing to file /builds/slave/test/properties/build_url 06:56:08 INFO - Contents: 06:56:08 INFO - build_url:https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 06:56:09 INFO - Running post-action listener: _resource_record_post_action 06:56:09 INFO - Running post-action listener: set_extra_try_arguments 06:56:09 INFO - [mozharness: 2016-09-23 13:56:09.258196Z] Finished download-and-extract step (success) 06:56:09 INFO - [mozharness: 2016-09-23 13:56:09.258346Z] Running populate-webroot step. 06:56:09 INFO - Running pre-action listener: _resource_record_pre_action 06:56:09 INFO - Running main action method: populate_webroot 06:56:09 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:56:09 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:56:09 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:56:09 INFO - '--tppagecycles', 06:56:09 INFO - '7'], 06:56:09 INFO - 'tests': ['tsvgm']}}, 06:56:09 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:56:09 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 06:56:09 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:56:09 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 06:56:09 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:56:09 INFO - 'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:56:09 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:56:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:56:09 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:56:09 INFO - 'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['damp', 'tps']}, 06:56:09 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:56:09 INFO - 'tests': ['damp', 'tps']}, 06:56:09 INFO - 'g3': {'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['dromaeo_dom']}, 06:56:09 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:56:09 INFO - 'g4': {'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['basic_compositor_video']}, 06:56:09 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 06:56:09 INFO - 'other': {'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['a11yr', 06:56:09 INFO - 'ts_paint', 06:56:09 INFO - 'tpaint', 06:56:09 INFO - 'sessionrestore', 06:56:09 INFO - 'sessionrestore_no_auto_restore', 06:56:09 INFO - 'tabpaint']}, 06:56:09 INFO - 'other-e10s': {'tests': ['a11yr', 06:56:09 INFO - 'ts_paint', 06:56:09 INFO - 'tpaint', 06:56:09 INFO - 'sessionrestore', 06:56:09 INFO - 'sessionrestore_no_auto_restore', 06:56:09 INFO - 'tabpaint']}, 06:56:09 INFO - 'other-e10s_l64': {'tests': ['a11yr', 06:56:09 INFO - 'ts_paint', 06:56:09 INFO - 'tpaint', 06:56:09 INFO - 'sessionrestore', 06:56:09 INFO - 'sessionrestore_no_auto_restore', 06:56:09 INFO - 'tabpaint']}, 06:56:09 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 06:56:09 INFO - 'ts_paint', 06:56:09 INFO - 'tpaint', 06:56:09 INFO - 'sessionrestore', 06:56:09 INFO - 'sessionrestore_no_auto_restore', 06:56:09 INFO - 'tabpaint']}, 06:56:09 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['a11yr', 06:56:09 INFO - 'ts_paint', 06:56:09 INFO - 'tpaint', 06:56:09 INFO - 'sessionrestore', 06:56:09 INFO - 'sessionrestore_no_auto_restore', 06:56:09 INFO - 'tabpaint']}, 06:56:09 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['a11yr', 06:56:09 INFO - 'ts_paint', 06:56:09 INFO - 'tpaint', 06:56:09 INFO - 'sessionrestore', 06:56:09 INFO - 'sessionrestore_no_auto_restore', 06:56:09 INFO - 'tabpaint']}, 06:56:09 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['tsvgx', 06:56:09 INFO - 'tsvgr_opacity', 06:56:09 INFO - 'tart', 06:56:09 INFO - 'tscrollx', 06:56:09 INFO - 'cart']}, 06:56:09 INFO - 'svgr-e10s': {'tests': ['tsvgx', 06:56:09 INFO - 'tsvgr_opacity', 06:56:09 INFO - 'tart', 06:56:09 INFO - 'tscrollx', 06:56:09 INFO - 'cart']}, 06:56:09 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:56:09 INFO - 'talos_options': ['--disable-e10s'], 06:56:09 INFO - 'tests': ['tp5o']}, 06:56:09 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:56:09 INFO - 'tests': ['tp5o']}, 06:56:09 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:56:09 INFO - 'talos_options': ['--disable-e10s', 06:56:09 INFO - '--xperf_path', 06:56:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:56:09 INFO - 'tests': ['tp5n']}, 06:56:09 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:56:09 INFO - 'talos_options': ['--xperf_path', 06:56:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:56:09 INFO - 'tests': ['tp5n']}}, 06:56:09 INFO - 'talos.zip': {'path': '', 06:56:09 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:56:09 INFO - Running post-action listener: _resource_record_post_action 06:56:09 INFO - [mozharness: 2016-09-23 13:56:09.277073Z] Finished populate-webroot step (success) 06:56:09 INFO - [mozharness: 2016-09-23 13:56:09.277203Z] Running create-virtualenv step. 06:56:09 INFO - Running pre-action listener: _resource_record_pre_action 06:56:09 INFO - Running main action method: create_virtualenv 06:56:09 INFO - Creating virtualenv /builds/slave/test/build/venv 06:56:09 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 06:56:09 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:56:09 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:56:09 INFO - Using real prefix '/tools/python27' 06:56:09 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:56:10 INFO - Installing distribute.............................................................................................................................................................................................done. 06:56:12 INFO - Installing pip.................done. 06:56:12 INFO - Return code: 0 06:56:12 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:56:12 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:12 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:12 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 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:12 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 06:56:12 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 06:56:12 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:12 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:12 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:12 INFO - 'HOME': '/Users/cltbld', 06:56:12 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:12 INFO - 'LOGNAME': 'cltbld', 06:56:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:12 INFO - 'MOZ_NO_REMOTE': '1', 06:56:12 INFO - 'NO_EM_RESTART': '1', 06:56:12 INFO - 'PAGER': '/bin/cat', 06:56:12 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:12 INFO - 'PWD': '/builds/slave/test', 06:56:12 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:12 INFO - 'SHELL': '/bin/bash', 06:56:12 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:12 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:12 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:12 INFO - 'USER': 'cltbld', 06:56:12 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:12 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:12 INFO - 'XPC_FLAGS': '0x0', 06:56:12 INFO - 'XPC_SERVICE_NAME': '0', 06:56:12 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:13 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 06:56:13 INFO - Cleaning up... 06:56:13 INFO - Return code: 0 06:56:13 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 06:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:13 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 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:13 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 06:56:13 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 06:56:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:13 INFO - 'HOME': '/Users/cltbld', 06:56:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:13 INFO - 'LOGNAME': 'cltbld', 06:56:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:13 INFO - 'MOZ_NO_REMOTE': '1', 06:56:13 INFO - 'NO_EM_RESTART': '1', 06:56:13 INFO - 'PAGER': '/bin/cat', 06:56:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:13 INFO - 'PWD': '/builds/slave/test', 06:56:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:13 INFO - 'SHELL': '/bin/bash', 06:56:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:13 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:13 INFO - 'USER': 'cltbld', 06:56:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:13 INFO - 'XPC_FLAGS': '0x0', 06:56:13 INFO - 'XPC_SERVICE_NAME': '0', 06:56:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:13 INFO - Downloading/unpacking psutil>=3.1.1 06:56:13 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 06:56:13 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 06:56:13 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 06:56:13 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 06:56:13 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 06:56:13 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 06:56:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:56:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:56:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:56:16 INFO - Installing collected packages: psutil 06:56:16 INFO - Running setup.py install for psutil 06:56:16 INFO - building 'psutil._psutil_osx' extension 06:56:16 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 06:56:17 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 06:56:17 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 06:56:17 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 06:56:17 INFO - building 'psutil._psutil_posix' extension 06:56:17 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 06:56:17 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 06:56:17 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 06:56:17 INFO - ^ 06:56:17 INFO - 1 warning generated. 06:56:17 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 06:56:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:56:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:56:17 INFO - Successfully installed psutil 06:56:17 INFO - Cleaning up... 06:56:17 INFO - Return code: 0 06:56:17 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 06:56:17 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:17 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:17 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 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:17 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 06:56:17 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 06:56:17 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:17 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:17 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:17 INFO - 'HOME': '/Users/cltbld', 06:56:17 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:17 INFO - 'LOGNAME': 'cltbld', 06:56:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:17 INFO - 'MOZ_NO_REMOTE': '1', 06:56:17 INFO - 'NO_EM_RESTART': '1', 06:56:17 INFO - 'PAGER': '/bin/cat', 06:56:17 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:17 INFO - 'PWD': '/builds/slave/test', 06:56:17 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:17 INFO - 'SHELL': '/bin/bash', 06:56:17 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:17 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:17 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:17 INFO - 'USER': 'cltbld', 06:56:17 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:17 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:17 INFO - 'XPC_FLAGS': '0x0', 06:56:17 INFO - 'XPC_SERVICE_NAME': '0', 06:56:17 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:18 INFO - Downloading/unpacking mozsystemmonitor==0.3 06:56:18 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 06:56:18 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 06:56:18 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 06:56:18 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 06:56:18 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 06:56:18 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 06:56:20 INFO - Downloading mozsystemmonitor-0.3.tar.gz 06:56:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:56:20 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 06:56:20 INFO - Installing collected packages: mozsystemmonitor 06:56:20 INFO - Running setup.py install for mozsystemmonitor 06:56:20 INFO - Successfully installed mozsystemmonitor 06:56:20 INFO - Cleaning up... 06:56:20 INFO - Return code: 0 06:56:20 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 06:56:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 06:56:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 06:56:20 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:20 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:20 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:20 INFO - 'HOME': '/Users/cltbld', 06:56:20 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:20 INFO - 'LOGNAME': 'cltbld', 06:56:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:20 INFO - 'MOZ_NO_REMOTE': '1', 06:56:20 INFO - 'NO_EM_RESTART': '1', 06:56:20 INFO - 'PAGER': '/bin/cat', 06:56:20 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:20 INFO - 'PWD': '/builds/slave/test', 06:56:20 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:20 INFO - 'SHELL': '/bin/bash', 06:56:20 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:20 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:20 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:20 INFO - 'USER': 'cltbld', 06:56:20 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:20 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:20 INFO - 'XPC_FLAGS': '0x0', 06:56:20 INFO - 'XPC_SERVICE_NAME': '0', 06:56:20 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:21 INFO - Downloading/unpacking jsonschema==2.5.1 06:56:21 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 06:56:21 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 06:56:21 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 06:56:21 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 06:56:21 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 06:56:21 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 06:56:23 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:56:23 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 06:56:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:56:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:56:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:56:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:56:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:56:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:56:24 INFO - Downloading functools32-3.2.3-2.tar.gz 06:56:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:56:24 INFO - warning: no files found matching '*.txt' 06:56:24 INFO - no previously-included directories found matching 'build' 06:56:24 INFO - no previously-included directories found matching 'dist' 06:56:24 INFO - no previously-included directories found matching '.git*' 06:56:24 INFO - Installing collected packages: jsonschema, functools32 06:56:24 INFO - Running setup.py install for functools32 06:56:24 INFO - warning: no files found matching '*.txt' 06:56:24 INFO - no previously-included directories found matching 'build' 06:56:24 INFO - no previously-included directories found matching 'dist' 06:56:24 INFO - no previously-included directories found matching '.git*' 06:56:24 INFO - Successfully installed jsonschema functools32 06:56:24 INFO - Cleaning up... 06:56:24 INFO - Return code: 0 06:56:24 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 06:56:24 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:24 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:24 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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:24 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', 'functools32==3.2.3-2'] in /builds/slave/test/build 06:56:24 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 functools32==3.2.3-2 06:56:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:24 INFO - 'HOME': '/Users/cltbld', 06:56:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:24 INFO - 'LOGNAME': 'cltbld', 06:56:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:24 INFO - 'MOZ_NO_REMOTE': '1', 06:56:24 INFO - 'NO_EM_RESTART': '1', 06:56:24 INFO - 'PAGER': '/bin/cat', 06:56:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:24 INFO - 'PWD': '/builds/slave/test', 06:56:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:24 INFO - 'SHELL': '/bin/bash', 06:56:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:24 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:24 INFO - 'USER': 'cltbld', 06:56:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:24 INFO - 'XPC_FLAGS': '0x0', 06:56:24 INFO - 'XPC_SERVICE_NAME': '0', 06:56:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:24 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 06:56:24 INFO - Cleaning up... 06:56:24 INFO - Return code: 0 06:56:24 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:56:24 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:24 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:24 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 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:24 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 06:56:24 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 06:56:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:24 INFO - 'HOME': '/Users/cltbld', 06:56:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:24 INFO - 'LOGNAME': 'cltbld', 06:56:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:24 INFO - 'MOZ_NO_REMOTE': '1', 06:56:24 INFO - 'NO_EM_RESTART': '1', 06:56:24 INFO - 'PAGER': '/bin/cat', 06:56:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:24 INFO - 'PWD': '/builds/slave/test', 06:56:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:24 INFO - 'SHELL': '/bin/bash', 06:56:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:24 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:24 INFO - 'USER': 'cltbld', 06:56:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:24 INFO - 'XPC_FLAGS': '0x0', 06:56:24 INFO - 'XPC_SERVICE_NAME': '0', 06:56:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:24 INFO - Downloading/unpacking blobuploader==1.2.4 06:56:24 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 06:56:24 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 06:56:24 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 06:56:24 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 06:56:24 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 06:56:24 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 06:56:27 INFO - Downloading blobuploader-1.2.4.tar.gz 06:56:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:56:27 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:56:27 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 06:56:27 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 06:56:27 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 06:56:27 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 06:56:27 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 06:56:27 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 06:56:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:56:28 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:56:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:56:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:56:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:56:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:56:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:56:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:56:28 INFO - Downloading docopt-0.6.1.tar.gz 06:56:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:56:28 INFO - Installing collected packages: blobuploader, requests, docopt 06:56:28 INFO - Running setup.py install for blobuploader 06:56:28 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:56:28 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:56:28 INFO - Running setup.py install for requests 06:56:29 INFO - Running setup.py install for docopt 06:56:29 INFO - Successfully installed blobuploader requests docopt 06:56:29 INFO - Cleaning up... 06:56:29 INFO - Return code: 0 06:56:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:56:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:29 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 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:29 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 06:56:29 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 06:56:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:29 INFO - 'HOME': '/Users/cltbld', 06:56:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:29 INFO - 'LOGNAME': 'cltbld', 06:56:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:29 INFO - 'MOZ_NO_REMOTE': '1', 06:56:29 INFO - 'NO_EM_RESTART': '1', 06:56:29 INFO - 'PAGER': '/bin/cat', 06:56:29 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:29 INFO - 'PWD': '/builds/slave/test', 06:56:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:29 INFO - 'SHELL': '/bin/bash', 06:56:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:29 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:29 INFO - 'USER': 'cltbld', 06:56:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:29 INFO - 'XPC_FLAGS': '0x0', 06:56:29 INFO - 'XPC_SERVICE_NAME': '0', 06:56:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:56:29 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-lld8rh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:56:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:56:29 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-r49GVs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-_6kNNn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-vtqR2z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-304y63-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-n_a4Wk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-IdfTyD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-8cXuQi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-IG2a3F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-aVf2Fe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-oaEs8Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:56:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:56:30 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-ORcGBq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:56:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:56:31 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-hihd38-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:56:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:56:31 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-DlDXM7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:56:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:56:31 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-ZSjPWk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:56:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:56:31 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-k08fHA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:56:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:56:31 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-jmL9Ez-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:56:31 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:56:31 INFO - Running setup.py install for manifestparser 06:56:31 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:56:31 INFO - Running setup.py install for mozcrash 06:56:31 INFO - Running setup.py install for mozdebug 06:56:32 INFO - Running setup.py install for mozdevice 06:56:32 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:56:32 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:56:32 INFO - Running setup.py install for mozfile 06:56:32 INFO - Running setup.py install for mozhttpd 06:56:32 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:56:32 INFO - Running setup.py install for mozinfo 06:56:32 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:56:32 INFO - Running setup.py install for mozInstall 06:56:32 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:56:32 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:56:32 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:56:32 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:56:32 INFO - Running setup.py install for mozleak 06:56:32 INFO - Running setup.py install for mozlog 06:56:33 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:56:33 INFO - Running setup.py install for moznetwork 06:56:33 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:56:33 INFO - Running setup.py install for mozprocess 06:56:33 INFO - Running setup.py install for mozprofile 06:56:33 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:56:33 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:56:33 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:56:33 INFO - Running setup.py install for mozrunner 06:56:33 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:56:33 INFO - Running setup.py install for mozscreenshot 06:56:33 INFO - Running setup.py install for moztest 06:56:34 INFO - Running setup.py install for mozversion 06:56:34 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:56:34 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:56:34 INFO - Cleaning up... 06:56:34 INFO - Return code: 0 06:56:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:34 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 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:34 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 06:56:34 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 06:56:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:34 INFO - 'HOME': '/Users/cltbld', 06:56:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:34 INFO - 'LOGNAME': 'cltbld', 06:56:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:34 INFO - 'MOZ_NO_REMOTE': '1', 06:56:34 INFO - 'NO_EM_RESTART': '1', 06:56:34 INFO - 'PAGER': '/bin/cat', 06:56:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:34 INFO - 'PWD': '/builds/slave/test', 06:56:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:34 INFO - 'SHELL': '/bin/bash', 06:56:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:34 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:34 INFO - 'USER': 'cltbld', 06:56:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:34 INFO - 'XPC_FLAGS': '0x0', 06:56:34 INFO - 'XPC_SERVICE_NAME': '0', 06:56:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:56:34 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-Btn4Fp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:56:34 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)) 06:56:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:56:34 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-fyr_JG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:56:34 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)) 06:56:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:56:34 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-nk2RPb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:56:34 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)) 06:56:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:56:34 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-VWgV10-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:56:34 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)) 06:56:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:56:34 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-sPmBTc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:56:35 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-UMqfT9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:56:35 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-BOO6Lz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:56:35 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-Menpu6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:56:35 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-02oZha-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:56:35 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-pTyqTL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:56:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-4X56hj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:56:35 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-Y4Oweg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:56:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-poyKKB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:56:35 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-tWI2dc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:56:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 06:56:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:56:35 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-5YqtBp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:56:36 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)) 06:56:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:56:36 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-HTqwZu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:56:36 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)) 06:56:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:56:36 INFO - Running setup.py (path:/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/pip-X9Gtr2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:56:36 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)) 06:56:36 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)) 06:56:36 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)) 06:56:36 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)) 06:56:36 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)) 06:56:36 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)) 06:56:36 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:56: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 06:56: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 06:56: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 06:56: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 06:56: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 06:56: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 06:56:38 INFO - Downloading blessings-1.6.tar.gz 06:56:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:56:38 INFO - Installing collected packages: blessings 06:56:38 INFO - Running setup.py install for blessings 06:56:39 INFO - Successfully installed blessings 06:56:39 INFO - Cleaning up... 06:56:39 INFO - Return code: 0 06:56:39 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:56:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:56:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:56:39 INFO - Reading from file tmpfile_stdout 06:56:39 INFO - Current package versions: 06:56:39 INFO - blessings == 1.6 06:56:39 INFO - blobuploader == 1.2.4 06:56:39 INFO - docopt == 0.6.1 06:56:39 INFO - functools32 == 3.2.3-2 06:56:39 INFO - jsonschema == 2.5.1 06:56:39 INFO - manifestparser == 1.1 06:56:39 INFO - mozInstall == 1.12 06:56:39 INFO - mozcrash == 0.17 06:56:39 INFO - mozdebug == 0.1 06:56:39 INFO - mozdevice == 0.48 06:56:39 INFO - mozfile == 1.2 06:56:39 INFO - mozhttpd == 0.7 06:56:39 INFO - mozinfo == 0.9 06:56:39 INFO - mozleak == 0.1 06:56:39 INFO - mozlog == 3.4 06:56:39 INFO - moznetwork == 0.27 06:56:39 INFO - mozprocess == 0.23 06:56:39 INFO - mozprofile == 0.28 06:56:39 INFO - mozrunner == 6.12 06:56:39 INFO - mozscreenshot == 0.1 06:56:39 INFO - mozsystemmonitor == 0.3 06:56:39 INFO - moztest == 0.7 06:56:39 INFO - mozversion == 1.4 06:56:39 INFO - psutil == 3.1.1 06:56:39 INFO - requests == 1.2.3 06:56:39 INFO - wsgiref == 0.1.2 06:56:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56:39 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 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56:39 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 06:56:39 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 06:56:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:39 INFO - 'HOME': '/Users/cltbld', 06:56:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:39 INFO - 'LOGNAME': 'cltbld', 06:56:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:39 INFO - 'MOZ_NO_REMOTE': '1', 06:56:39 INFO - 'NO_EM_RESTART': '1', 06:56:39 INFO - 'PAGER': '/bin/cat', 06:56:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:39 INFO - 'PWD': '/builds/slave/test', 06:56:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:39 INFO - 'SHELL': '/bin/bash', 06:56:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:39 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:39 INFO - 'USER': 'cltbld', 06:56:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:39 INFO - 'XPC_FLAGS': '0x0', 06:56:39 INFO - 'XPC_SERVICE_NAME': '0', 06:56:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 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)) 06:56:39 INFO - Cleaning up... 06:56:39 INFO - Return code: 0 06:56:39 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:56:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:56:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:56:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:56: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']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10394a490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1038c0570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe5e3d82e00>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:56: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'] in /builds/slave/test/build 06:56: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 06:56:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:56:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:56:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:56:39 INFO - 'HOME': '/Users/cltbld', 06:56:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:56:39 INFO - 'LOGNAME': 'cltbld', 06:56:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:56:39 INFO - 'MOZ_NO_REMOTE': '1', 06:56:39 INFO - 'NO_EM_RESTART': '1', 06:56:39 INFO - 'PAGER': '/bin/cat', 06:56:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:56:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:56:39 INFO - 'PWD': '/builds/slave/test', 06:56:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:56:39 INFO - 'SHELL': '/bin/bash', 06:56:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:56:39 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:56:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:56:39 INFO - 'USER': 'cltbld', 06:56:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:56:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:56:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:56:39 INFO - 'XPC_FLAGS': '0x0', 06:56:39 INFO - 'XPC_SERVICE_NAME': '0', 06:56:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:56:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:56:39 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 06:56:39 INFO - Cleaning up... 06:56:39 INFO - Return code: 0 06:56:39 INFO - Running post-action listener: _resource_record_post_action 06:56:39 INFO - Running post-action listener: _start_resource_monitoring 06:56:39 INFO - Starting resource monitoring. 06:56:39 INFO - [mozharness: 2016-09-23 13:56:39.991775Z] Finished create-virtualenv step (success) 06:56:39 INFO - [mozharness: 2016-09-23 13:56:39.992769Z] Running install step. 06:56:39 INFO - Running pre-action listener: _resource_record_pre_action 06:56:39 INFO - Running main action method: install 06:56:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:56:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:56:40 INFO - Reading from file tmpfile_stdout 06:56:40 INFO - Detecting whether we're running mozinstall >=1.0... 06:56:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:56:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:56:40 INFO - Reading from file tmpfile_stdout 06:56:40 INFO - Output received: 06:56:40 INFO - Usage: mozinstall [options] installer 06:56:40 INFO - Options: 06:56:40 INFO - -h, --help show this help message and exit 06:56:40 INFO - -d DEST, --destination=DEST 06:56:40 INFO - Directory to install application into. [default: 06:56:40 INFO - "/builds/slave/test"] 06:56:40 INFO - --app=APP Application being installed. [default: firefox] 06:56:40 INFO - mkdir: /builds/slave/test/build/application 06:56:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 06:56:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 06:57:12 INFO - Reading from file tmpfile_stdout 06:57:12 INFO - Output received: 06:57:12 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 06:57:12 INFO - Running post-action listener: _resource_record_post_action 06:57:12 INFO - [mozharness: 2016-09-23 13:57:12.433770Z] Finished install step (success) 06:57:12 INFO - [mozharness: 2016-09-23 13:57:12.433932Z] Running run-tests step. 06:57:12 INFO - Running pre-action listener: _resource_record_pre_action 06:57:12 INFO - Running main action method: run_tests 06:57:12 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 06:57:12 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 06:57:12 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 06:57:12 INFO - 2016-09-23 06:57:12.449 screenresolution[1929:11576] starting screenresolution argv=screenresolution get 06:57:12 INFO - 2016-09-23 06:57:12.451 screenresolution[1929:11576] Display 0: 1600x1200x32@60 06:57:12 INFO - 2016-09-23 06:57:12.457 screenresolution[1930:11578] starting screenresolution argv=screenresolution list 06:57:12 INFO - Available Modes on Display 0 06:57:12 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 06:57:12 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 06:57:12 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 06:57:12 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 06:57:12 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 06:57:12 INFO - Intel Iris: 06:57:12 INFO - Chipset Model: Intel Iris 06:57:12 INFO - Type: GPU 06:57:12 INFO - Bus: Built-In 06:57:12 INFO - VRAM (Dynamic, Max): 1536 MB 06:57:12 INFO - Vendor: Intel (0x8086) 06:57:12 INFO - Device ID: 0x0a2e 06:57:12 INFO - Revision ID: 0x0009 06:57:12 INFO - Displays: 06:57:12 INFO - Display: 06:57:12 INFO - Resolution: 1600 x 1200 @ 60 Hz 06:57:12 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 06:57:12 INFO - Display Serial Number: 1600x1200 60 06:57:12 INFO - Main Display: Yes 06:57:12 INFO - Mirror: Off 06:57:12 INFO - Online: Yes 06:57:12 INFO - Rotation: Supported 06:57:12 INFO - Return code: 0 06:57:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:57:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:57:12 INFO - Python 2.7.3 06:57:12 INFO - Return code: 0 06:57:12 INFO - grabbing minidump binary from tooltool 06:57:12 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:57:12 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/macosx64/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 0x10375ed30>, '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 0x1035c4db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103756b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:57:12 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/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 06:57:12 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/macosx64/releng.manifest -o -c /builds/tooltool_cache 06:57:12 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/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 06:57:12 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:57:12 INFO - Return code: 0 06:57:12 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 06:57:12 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:57:12 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:57:12 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 06:57:12 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:57:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0128', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 06:57:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0128 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 06:57:12 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render', 06:57:12 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:57:12 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:57:12 INFO - 'HOME': '/Users/cltbld', 06:57:12 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:57:12 INFO - 'LOGNAME': 'cltbld', 06:57:12 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:57:12 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 06:57:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:57:12 INFO - 'MOZ_NO_REMOTE': '1', 06:57:12 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:57:12 INFO - 'NO_EM_RESTART': '1', 06:57:12 INFO - 'PAGER': '/bin/cat', 06:57:12 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:57:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:57:12 INFO - 'PWD': '/builds/slave/test', 06:57:12 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:57:12 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:57:12 INFO - 'SHELL': '/bin/bash', 06:57:12 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners', 06:57:12 INFO - 'TMPDIR': '/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/', 06:57:12 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:57:12 INFO - 'USER': 'cltbld', 06:57:12 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:57:12 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:57:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:57:12 INFO - 'XPC_FLAGS': '0x0', 06:57:12 INFO - 'XPC_SERVICE_NAME': '0', 06:57:12 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:57:12 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0128', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 06:57:13 INFO - mozversion application_buildid: 20160923055359 06:57:13 INFO - mozversion application_changeset: 4dd6247f67104db93b1a495aacb2cf5410a62af1 06:57:13 INFO - mozversion application_display_name: FirefoxDeveloperEdition 06:57:13 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:57:13 INFO - mozversion application_name: Firefox 06:57:13 INFO - mozversion application_remotingname: firefox-dev 06:57:13 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:57:13 INFO - mozversion application_vendor: Mozilla 06:57:13 INFO - mozversion application_version: 51.0a2 06:57:13 INFO - mozversion platform_buildid: 20160923055359 06:57:13 INFO - mozversion platform_changeset: 4dd6247f67104db93b1a495aacb2cf5410a62af1 06:57:13 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:57:13 INFO - mozversion platform_version: 51.0a2 06:57:13 INFO - using testdate: 1474639033 06:57:13 INFO - actual date: 1474639033 06:57:13 INFO - starting webserver on 'localhost:49782' 06:57:13 INFO - SUITE-START | Running 2 tests 06:57:13 INFO - TEST-START | dromaeo_css 06:57:13 INFO - operating with platform_type : mac_ 06:57:13 INFO - Initialising browser for dromaeo_css test... 06:57:13 INFO - TEST-INFO | started process 1940 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/tmpkOXJ5H/profile http://localhost:49782/getInfo.html) 06:57:15 INFO - PROCESS | 1940 | __metrics Screen width/height:1600/1200 06:57:15 INFO - PROCESS | 1940 | colorDepth:24 06:57:15 INFO - PROCESS | 1940 | Browser inner width/height: 1024/663 06:57:15 INFO - PROCESS | 1940 | __metrics 06:57:16 ERROR - PROCESS | 1940 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 06:57:16 INFO - TEST-INFO | 1940: exit 0 06:57:16 INFO - Browser initialized. 06:57:16 INFO - Running cycle 1/1 for dromaeo_css test... 06:57:16 INFO - TEST-INFO | started process 1943 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/tmpkOXJ5H/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:57:28 INFO - PROCESS | 1943 | RSS: Main: 235196416 06:57:28 INFO - PROCESS | 1943 | 06:58:18 INFO - PROCESS | 1943 | 1474639098500 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] 07:00:30 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49782/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49782/tests/dromaeo/cssquery-ext.html) 07:00:31 INFO - PROCESS | 1943 | RSS: Main: 247296000 07:00:31 INFO - PROCESS | 1943 | 07:03:34 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49782/tests/dromaeo/cssquery-ext.html (next: http://localhost:49782/tests/dromaeo/cssquery-jquery.html) 07:03:34 INFO - PROCESS | 1943 | RSS: Main: 257060864 07:03:34 INFO - PROCESS | 1943 | 07:06:36 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49782/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49782/tests/dromaeo/cssquery-mootools.html) 07:06:37 INFO - PROCESS | 1943 | RSS: Main: 259371008 07:06:37 INFO - PROCESS | 1943 | 07:09:39 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49782/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49782/tests/dromaeo/cssquery-prototype.html) 07:09:39 INFO - PROCESS | 1943 | RSS: Main: 259620864 07:09:39 INFO - PROCESS | 1943 | 07:12:42 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49782/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49782/tests/dromaeo/cssquery-yui.html) 07:12:43 INFO - PROCESS | 1943 | RSS: Main: 264089600 07:12:43 INFO - PROCESS | 1943 | 07:15:45 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49782/tests/dromaeo/cssquery-yui.html (next: http://localhost:49782/tests/dromaeo/cssquery-dojo.html) 07:15:46 INFO - PROCESS | 1943 | RSS: Main: 266665984 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - PROCESS | 1943 | __start_tp_report 07:15:46 INFO - PROCESS | 1943 | _x_x_mozilla_page_load 07:15:46 INFO - PROCESS | 1943 | _x_x_mozilla_page_load_details 07:15:46 INFO - PROCESS | 1943 | |i|pagename|runs| 07:15:46 INFO - PROCESS | 1943 | |0;dojo.html;2816.4930312543734;2839.063109173973;3209.358128374325;3257.6742325767414;3289.9307724989376;4694.366260554824;5711.086226203808;5814.883702325951;5818.447247511485;5832.416758324176;5780.988327042772;5843.386444423328;5873.794417195399;5908.556858235639;5926.229590153274;5323.334583177112;5347.786088556453;5365.114756065264;5382.730863456831;5384.5692344612335;5369.087255166612;5375.139977603584;5381.81163659272;5390.649607775502;5455.972720136414;5207.947920520804;5238.030964271603;5358.142697168454;5372.892542149155;5383.138697808351;5148.974255128719;5245.160774276116;5284.101702710548;5300.443453437372;5300.893982120375;5226.73866306687;5251.291075704769;5261.552768014723;5303.496167864047;5362.678239305654;5521.779128834882;5843.5325173985975;5861.17943487912;5970.641761494324;5975.641461512323;6137.478314343286;6139.798803208747;6167.951448253808;6199.225096862892;6207.068939659042;6226.470749986257;6266.780662676784;6310.116583678288;6342;6359.618422894641;5865.648061116347;5998.970005149947;6003.339632640406;6006;6033.5474839387225;6287;6385.840353991188;6393.520485963571;6408.423241908157;6413.967930160413;6281.78013769525;6288.402601752918;6294.339094395114;6299.905501417483;6317.557770956081;6112.786052488142;6132.845047373359;6255.093011513305;6269.623822570569;6299.590526615755;4706.741129237925;6257.937420625826;6266.436020758154;6288.968555157287;6304.432601065926;6231.189945307172;6263.498920086382;6264.029075493215;6278.434940855345;6282.623042617458;4864.73243971585;4945.629077819178;5008.348914641147;5020.974895125574;5032.748362581856;4183.205191013698;4423.977880110643;4447.955520444754;4449.755263460476;4513.232750432434;4667.8366257181515;5924.61490003157;5984.7606095756555;5990.281166260077;6001.459868611846;6170.938290617126;6290.591111577733;6292.937070629327;6298.748050077946;6313.305536390993;5258.605604579672;5803.303603567599;5857.648541087463;5926.111083337534;5952.880942381128;4469.620082293041;4602.803271149525;4616.722996620214;5495.395506494282;5510.311211098613;6345.471224025856;6383;6402.519811014193;6434.774782882577;6443.710033048524;4834;6022.819315420545;6045.78839740607;6145.525073982301;6161.969190154021;6351.047342898602;6395.488360931207;6405.487560995016;6423.518236132215;6429.54993150475;6206.286277078013;6222.346653601307;6239.625622462485;6247.875042499216;6262.248530176408;6049.032154855378;6105.419985101408;6131.202943617302;6263.123162757309;6263.74945002213;6141.486007784364;6144.371741488599;6183.505319574333;6194.845128871814;6218.906716399167;6172.6913654318005;6185.536084793748;6187.381261873777;6201.503879689524;6256.593321434092;5703.201551782837;5960.284765828128;6027.457528822427;6125.295591007091;6136.754529818757;5212.50481204285;5282.498162674539;6086.995645718407;6128.717018009349;6269.247690277013;4977.726225057657;6120.54095942815;6122.112293717475;6143.877122457615;6154.1999540059505 07:15:46 INFO - PROCESS | 1943 | |1;ext.html;462.58598554293906;505.9544640982312;527.5594878276642;527.8231792349563;542.4141926719144;37851;41141.38287925684;41168.38247426287;41229.79385103078;41247.79376103119;41458;41911.58088419122;42007.57992420075;42183;42193;9688.224942004657;9827.65603203888;9907.752306192331;9922.702318930444;9933.205343572497;9787.363821351624;9833.803323933516;9874.061964113434;9883.604655813759;9917;9918.3057185997;9923.007699230091;9937.45344006083;9943.701688949342;9957.651482198124;9781.657641982532;9839.655612053615;9842.852357214575;9856.50717464124;9872.35829671069;9628.566714497865;9704.369216001009;9722.708318750378;9775.706728798148;9797.167240784542;35170.94487165389;35494.64505354939;35516;35530.46704299437;35549.64450355489;3160.1783536280504;3333.4999750037687;3347.2468694543777;3351.597808263024;3769.1542288557216;29664.851675741484;30117.548236776467;30484.390312193853;30710.846445767627;31177.844110779526;3165.446046941776;3264.836758162106;3282.491213861855;3287.211069343364;3299.9010029699148;264426.3557364421;314054;328894.3555282208;331429.3428532866;331703;58730.706346467996;59348;59478.10782838261;59504.404955950755;59632.70183649054;34339.656603434145;34757.826210868785;34899.4765078524;36042.918712438666;65419.67290163519;12136.69658258533;14615.78076328856;16130.75803862943;16310.673786524441;16332.591685207964;11268.830967535494;12971.221726696429;13134.408951597201;13136.34318284101;13158.60524184276;15760.133192674284;19065.523361915784;19179.94510301947;19182.944938028544;19446.70829937552;6947.826304342432;7207.918812178215;7341.816454588678;7360.447966402541;7818.4136189785995;870.6691457246333;916.867054277126;1001.8146642871092;1030.8711411073616;1091.8089334366455;24972.500549988898;29961.70038299633;30030.549541756893;30150.09549713512;30404.391912162075;1052.884182739898;1065.648336049102;1071.6624263357019;1082.826747720361;1124.971875703114;15098.698026039418;15653.608659783597;15751.921240393725;15760.975536590086;16047.919760401357;716510;734607;735754;739236;739375;57340.713296434085;57728.422715773144;57885.13172302419;57899;58011.70994145087;1196;1367.2070199284392;1390.5272207449314;1397.1337770582304;1400.3418393355107;24269.878650606635;29093.563596545646;29498.705012949595;29820.403591927607;30513.54229686601;49551.752241238566;54967;56658.43341566531;56800;59866;548351.5164848301;548713;555786;556213;556730;43254.783726081165;43362;43381.78309108434;43410.78294608507;43520.34719479147;47049.588512344686;47165.764171178926;47522.90481720847;47530.52469475261;47636.5236347646;39223.01942451348;39308;39621.60378396179;39961.2007759849;40560.98597535085;39296.80351598224;39315.410268845415;39409;40150.594729185505;41094.58905410908;32614.83692581522;37562.81218593889;38689.41965870571;39028.21943561056;39870.20259594734;33045.66954330522;35254.823725882234;35344.46983295201;35546.28907421889;35648.28703425969;25208.495830082928;25880.48239035171;26206.86896565505;26415.94336226606;26457.470850582496 07:15:46 INFO - PROCESS | 1943 | |2;jquery.html;334.9547811045509;376.67982215117155;382.21073483257055;382.9674477669398;403.2197697455424;19519.512012199702;19859.20563177473;20149;20746.792532074694;20902.790972090275;11748.236364636292;12032.879671203285;15133.848661513382;20348.677335973152;20902.686459703116;5384.030874442608;5595.440455954413;5597.916031259534;5600.719964001804;5612.635178713391;5248.632595718302;5480.6437581557275;5519.69641669708;5531.806386776464;5538.9169162462595;5510.063289240818;5521.337439507245;5531.197976293435;5532.336119665646;5540.861478463051;5273.736313184345;5514.6691198528015;5516.172574113875;5525.502704756551;5535.501804837564;5148.510891465305;5358.544523715489;5386.78452861885;5388.137897936312;5392.379876314235;10305.793884122275;10539.894601053968;11702.414879256003;12953.935230323883;12984.480620775157;2159.4169574214875;2163.891805409723;2166.2093335932427;2298.5981844767416;2836.928660317207;9766.755831104208;10423.478826058743;10483.895161048444;13035.86964130356;14790.852091479055;1826.1234607388394;1856.60083082138;1926.1236137557378;1932.5651728361147;1937.060525645061;98008;110575;122065.38967305106;123899;131492;11517.596884109016;11608.361540115206;11732.648020559396;11806.586769463027;12037.217580857392;14503.709925801424;14568.85431145675;14636.414543418357;14812.407503699947;14831.406743730346;6875.7937261882225;8583.141685831491;8651.610677519528;8730.083341249077;8802.955985220033;8596.097409772008;8622.267107295826;8650.913490865136;8787.912120878837;8808.823823523493;4469.351943968171;4551.977240113778;4558.293464513005;4618.838340658061;4623.468301145344;1885.6323017011825;1900.9809901900803;1950.951226219356;1952.248384372027;1952.66804643211;830.9459885107449;848.4442690038035;856;994.880614326271;1001.369137443406;15795.842041579437;20744.377668669964;21444.463888402915;21635.891820540797;21898.452538686342;801.7314199743151;911.3301723233418;941.3692825806589;946.8070231508349;949.5442187749919;7627.970224019798;10726.517306721216;11400.714982125513;11456.312621242752;11479.483423245974;518546;526241;528429;624907;627847;141041.29479352536;143125;144569;150583.24708376607;154151.50051535887;955.4028732042474;978.4765150644371;1000.9599616015278;1004.0411407106196;1012.0284526854302;18393.81606183921;19255.748376355492;19519.8048019518;19531.60936781285;19597.31409400664;43916.78041609772;44136.11727765491;49679.50961471162;53968.65078372915;56096.15855762248;82215;86610.56694716486;86663.13336866803;87369.56315218384;88134.11865881259;8095.473794203358;8113.472624279403;8243.629036693483;8418;8457.942757155355;11929.164958452826;13027.348632568144;13206.471741130246;13260.933695331461;13305.534306299232;8416.621252043795;11306.152038597302;11473.770524589629;11663.533458661559;11775.882241177478;9822.5088745561;10862.782744344911;11257.943710281395;11262.324260544394;11615.24500907472;11437.256578322382;11633.709157271136;11900.821487677866;11908.821367679666;11909.344986025852;8033.236842500187;8205.83588328242;8316.708915187939;8356.080831108451;8463;9634.421934683942;11297.491612877277;11335.376554289263;11633.302001879914;11739.354335511287 07:15:46 INFO - PROCESS | 1943 | |3;mootools.html;1358.449827819733;1545.0652355325028;1670.2316934210262;1849.9445016649488;1869.476546566961;7925.9603701981405;8141.837163256731;8695.39132260742;9318;9318.114779095984;7500.174980752113;8724.781880452992;9117.726468205949;9177.128172823572;9182.632694692204;2375.0381095656285;2411.46947671512;2415.4082249848725;2417.746136655652;2419.383057320381;2395.401149712572;2421.33413311339;2423.781859632633;2431.7081950166007;2437.7684120008657;2143.721316228888;2295.380247333219;2415.722191947922;2427.66012758214;2437.098273638756;2393.270052633946;2394.461246219604;2402.6876506054277;2415.263344679872;2416.673749043874;1963.4600484866633;2373.8219633527556;2378.2865140457966;2383.2611890313883;2385.260569223546;9112.997570267265;9154;9184.081591840762;9224.8616270756;9242.306826988002;5347.679139251657;5523.28197334344;5527.695976721278;5534.501894829485;5543.334799824047;3633.6729694327637;3685.1339935115225;3718.6653201211752;3737.1591391936868;3740.8503659853845;1068.668712699058;1072.1208608940594;1076.9030787229108;1078.1698092468835;1084.3927400655657;11698.239614425034;11907.404629768564;12027.639170824888;12037.699057523545;12077.818832717605;4081.6326530612387;4400.75795831226;4518.367428559938;4748.169070412664;4757.714537127784;9358.157765800974;9447;9454.527273636291;9467.90532094684;9471;5396.460353964572;5399.514043736082;5405.4324295949145;5411.188321751769;5413.160960051198;4495.21333766596;4646.186917289461;4864.489228631013;4986.401631804207;5066.949330506722;3392.508086327469;3851.557070936878;3925.8822235332987;3979.786165219578;3988.062805240766;1182.479708928069;1192.1595275330872;1203.8555373355077;1204.1931905623253;1216.2763155922212;715.1239731329081;757.7007082202499;836.6026137584598;911.6854685133618;946.8437707778139;5943.58394912352;5995.490383317467;6033.215681961405;6180.196574445384;6181.567290289637;813.520023186311;940.9529523523796;950.1543626172573;973.8490533967247;992.2310209587628;3644.7243464787643;3727.38498147808;3919.9020024499614;4077.1845630873945;4077.6747557044077;10763.892361076445;11139.944300278446;11148.498317575566;11166.553337866557;11172.938570835757;10995.450227488594;11055.834162487568;11066.28069175501;11107.38909359993;11111.38887361203;8001.959990200128;8336.416450848383;8370.246677799027;8400.705975290835;8459.619317130744;6001.609895356788;6005.159277701213;6113.572049956639;6129.785457508966;6167.444929956326;10117.29178957466;10163.54264058134;10276.794464110826;10283.43441110746;10365.01532354425;9880.407175569202;10273.74315642115;10328.638497652546;10437.060664540228;10455.215858810467;6460.772453233871;7080.362767350963;7292.343689067797;7650.73222437212;7828.921710783047;8422.494650321001;8604.48373097616;8697.434666746642;8697.652093916426;8704.477731336141;7584.8483030340185;7721.382289416721;7749.7287594933905;7771.844563108819;7838.608069596383;7425.146108197627;7557.508761930457;7574.166841647525;7608.619569021416;7723.806904827425;6161.691915404302;6390.808275751735;7061.540999834994;7246.6376681164675;7266.091738532684;3906.570277269555;4496.662750293675;4990.632598556969;5181.766820493162;5234.712090835041;5072.59419246452;5118.206677964921;5131.409887862944;5202.115640341075;5234.24103504982 07:15:46 INFO - PROCESS | 1943 | |4;prototype.html;262.39387015993054;283.2451516707973;314.48110617481166;314.70103401768324;321.27712646545257;5028.698278103317;5276.92084618731;5498.422665620113;5529.253550770644;5562.833115006551;4242.512111107224;4662.787675204446;4950.252609801559;5323.467653234675;5451.972740136293;3883.9029024274337;3986.8604598839047;4071.084006098634;4102.466679331683;4106.117184805266;4128.318827393477;4140.213359461693;4159.958400415987;4175.937360939588;4211.452511173543;3849.2878817418728;3859.8842034738864;4105.384192371138;4146.854860079898;4179.3939878717565;3934.8426062957446;4000.4599379084034;4049.2104039712267;4148.962759310172;4171.957010747313;3565.5899571549085;3583.5341405617364;3586.6951309138494;3588.6052534221217;3604.4593311003296;5233.398159211702;5271.42014378418;5281.445448227919;5345;5360;4349.847755328548;4668.743219122947;4746.359241502422;4770.16522108633;4839.104765618336;4752.004158253541;5784.768609255625;5799.971000145015;5846.2230440540825;5905.911411328833;3939;3948.2893079245723;3953.09078911849;3955.8330292563473;3958.9010274743073;4503.752293623849;5180.870478238036;5230.509304848138;5391.32608423947;5499.917501237444;3613.7831730095754;3984.5218573770753;3988.541317748438;3991.341428664296;3991.92016159681;3565.1265439967374;3841.442990766379;4005.4792876926394;4025.456563363967;4045.292073887058;4701.9529804701515;4703.200455922433;4731.4558825735485;4735.242361222188;4738.668293219442;4424.977875110604;5319.898640037163;5872.265966754156;5892.322382925932;5913;1359.6193065941552;1372.7048684532874;1374.762713557806;1375.2917247617486;1384.9376778045012;783.9372850171973;820.2248874813245;838.5890913452487;842.5113434208145;843.0978852627629;4527.7736113194205;4715.255355518411;4863.197572400585;4982.750862456863;5408.972955135199;5906.844001939261;5946.316173640001;5955.659976505338;5981.850453738604;5990.850228744316;3839.00371806659;4567.734070139866;5029.446760856303;5380.973095134499;5443.258157389677;2693.3805224798407;3139.1479027373957;3141.2723002348616;3144.292534179837;3156.779025468195;6099.9390006099375;6111.419415155553;6130.2030736004035;6174.969125154345;6198.721057552421;5410.296661433988;5532.838103998205;5640.307907627695;5861;6145.723442445101;6111.502681842888;6123.7244324006415;6129.785457508877;6161.8125565424525;6189.50483961282;4673.135469938073;4795;5588.972055139861;5902.734376952962;5906.9916228482525;5627.465390787868;5830.250924722651;5844.94155058444;5845.41545845412;5862.443067908542;5056.84829455117;5570.359408668055;5583.664980101207;6083.969580152071;6153.892299386153;3708.7218458616253;3754.5494540655295;3796.867109651149;3829.7893615851394;3971.2653159165648;4767.4994125617695;5989.071693887455;6063.666498342457;6072.8785424292155;6087.447700836436;4871.5128487151005;4885.071836351082;5595.944040559542;5815.883682326415;5849.239598852122;5475.698836564027;5740.569457290803;5829.988653914393;5837.854053648693;5868.383819699041;5440.945590544044;5480;5705;5718.170185540587;5734.627249228954;4842.806287748592;4983.277424773315;5459.426760190282;5773.826785196451;5787.276590426197;5746.798862039808;5786.1811204604755;5795;5797.4782269595935;5809.257222833217 07:15:46 INFO - PROCESS | 1943 | |5;yui.html;694.6974422956953;713.7180813578636;782.7651704488655;809.2918696140877;815.140027271229;15054.247287635615;15867;15882.76175857363;15899.52301430956;15932.442364517245;14270.643233919158;14290;14293.070950388217;14338.354774035168;14377.78433323501;660.0824853453703;685.099094690483;817.3706246190415;827.7765003449065;851.9659213631447;764.7246991083206;851.4848516647432;854.974350769478;863.4905405810571;867.3104881619128;892.3396686452011;917.8485549884294;919.1727445299217;920.585736418611;922.5479515037616;902.2601466797229;912.9771755706128;913.6345461815293;914.5381582300962;914.7713071732067;663.1081195791653;669.9095622091004;670.4368330602317;675.0212192321154;676.9864602707968;15275.618109547238;15398.153101579408;15405.922970385189;15408.845911540966;15440.996335238286;11519.36643484608;13717.382717777724;14787.852121478863;14792.18642974636;14988;11668.76662466746;12038.69903252417;12105.394730263451;12145.453454594564;12468.563600273947;3739.66343029126;3789.2610940866543;3807.4859893914245;3829.5978922213326;3866.2267546490534;119353;120880.39559802233;122308;122694;122704.38647806793;10862.34825910448;11062.280951738112;11183.217174797848;11229.606963756392;11298.039666628265;21624.351269461942;22468.887655561946;22664.773352266267;22745.886270568542;22776.43058923507;8187.14034526849;8218.301444377175;8230.876536851953;8347.04009038956;8402.369822263354;4490.910181796346;4525.660575456854;4594.287885377772;4596.793144308447;4688.249880019249;3593.586737525166;3657;3779.9244015119543;3780.092777733379;3791.2038471920655;718.1848601836848;723.4068064187315;726.8618962397128;727.3817255332925;728.4500202347194;520.1599416941611;582.4845012164266;616.4540447950027;628.2210059526246;641.377863472431;9663.806723865624;9818;9849.704508864745;9861.950690246646;9873.111419972238;562.4291344285554;567;582.5106910195456;619.8760247950428;670.3531092495765;4298.376735373354;4787.640926930494;4788.760561971888;4825.6139508839915;4864.197407427735;177572;178648;178872;181702;182349;115343.42328288473;127379;131765.3411732935;143470;148654;100698.49650751699;104721.47639261755;114662;115017;130976.69023309836;9614.615415383307;9931.900680993098;9935.801283974135;9991.200703943521;10014.188932632558;58215.70892145512;59691.92040278236;61042;65323;66407;66309;67405.3259467399;79324.60337698275;93852.59221111552;97545;12922.095453318178;13110.672233194246;13138.737225255632;13140.145890517086;13385.66535836612;13379.933100334825;13472.663183420493;13565;13897.16617002983;14192.290385480479;13823.930880345533;13849.16904985704;13932.651683707989;13956.860431395557;14419.78370324467;13731.239439419462;13886.236257005557;14120.364583593968;14329.140251584939;14639.92680036593;10518.947405262925;10846.891531084588;12267.018638509076;13245.933770331087;14374.496892608708;10940.577724895713;11368.54525818958;11581.82627260575;11827.586034488751;12419.627411177678;11494;11678.416079196177;11882.76234475323;11897.940510297392;11978.101642376681 07:15:46 INFO - PROCESS | 1943 | __end_tp_report 07:15:46 INFO - PROCESS | 1943 | __start_cc_report 07:15:46 INFO - PROCESS | 1943 | _x_x_mozilla_cycle_collect,374 07:15:46 INFO - PROCESS | 1943 | __end_cc_report 07:15:46 INFO - PROCESS | 1943 | __startTimestamp1474640146185__endTimestamp 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - PROCESS | 1943 | ------- Summary: start ------- 07:15:46 INFO - PROCESS | 1943 | Number of tests: 6 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - PROCESS | 1943 | [#0] dojo.html Cycles:165 Average:5748.69 Median:6027.46 stddev:718.06 (11.9%) stddev-sans-first:682.42 07:15:46 INFO - PROCESS | 1943 | Values: 2816.5 2839.1 3209.4 3257.7 3289.9 4694.4 5711.1 5814.9 5818.4 5832.4 5781.0 5843.4 5873.8 5908.6 5926.2 5323.3 5347.8 5365.1 5382.7 5384.6 5369.1 5375.1 5381.8 5390.6 5456.0 5207.9 5238.0 5358.1 5372.9 5383.1 5149.0 5245.2 5284.1 5300.4 5300.9 5226.7 5251.3 5261.6 5303.5 5362.7 5521.8 5843.5 5861.2 5970.6 5975.6 6137.5 6139.8 6168.0 6199.2 6207.1 6226.5 6266.8 6310.1 6342.0 6359.6 5865.6 5999.0 6003.3 6006.0 6033.5 6287.0 6385.8 6393.5 6408.4 6414.0 6281.8 6288.4 6294.3 6299.9 6317.6 6112.8 6132.8 6255.1 6269.6 6299.6 4706.7 6257.9 6266.4 6289.0 6304.4 6231.2 6263.5 6264.0 6278.4 6282.6 4864.7 4945.6 5008.3 5021.0 5032.7 4183.2 4424.0 4448.0 4449.8 4513.2 4667.8 5924.6 5984.8 5990.3 6001.5 6170.9 6290.6 6292.9 6298.7 6313.3 5258.6 5803.3 5857.6 5926.1 5952.9 4469.6 4602.8 4616.7 5495.4 5510.3 6345.5 6383.0 6402.5 6434.8 6443.7 4834.0 6022.8 6045.8 6145.5 6162.0 6351.0 6395.5 6405.5 6423.5 6429.5 6206.3 6222.3 6239.6 6247.9 6262.2 6049.0 6105.4 6131.2 6263.1 6263.7 6141.5 6144.4 6183.5 6194.8 6218.9 6172.7 6185.5 6187.4 6201.5 6256.6 5703.2 5960.3 6027.5 6125.3 6136.8 5212.5 5282.5 6087.0 6128.7 6269.2 4977.7 6120.5 6122.1 6143.9 6154.2 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - PROCESS | 1943 | [#1] ext.html Cycles:180 Average:67175.03 Median:39362.21 stddev:150566.24 (382.5%) stddev-sans-first:150905.30 07:15:46 INFO - PROCESS | 1943 | Values: 462.6 506.0 527.6 527.8 542.4 37851.0 41141.4 41168.4 41229.8 41247.8 41458.0 41911.6 42007.6 42183.0 42193.0 9688.2 9827.7 9907.8 9922.7 9933.2 9787.4 9833.8 9874.1 9883.6 9917.0 9918.3 9923.0 9937.5 9943.7 9957.7 9781.7 9839.7 9842.9 9856.5 9872.4 9628.6 9704.4 9722.7 9775.7 9797.2 35170.9 35494.6 35516.0 35530.5 35549.6 3160.2 3333.5 3347.2 3351.6 3769.2 29664.9 30117.5 30484.4 30710.8 31177.8 3165.4 3264.8 3282.5 3287.2 3299.9 264426.4 314054.0 328894.4 331429.3 331703.0 58730.7 59348.0 59478.1 59504.4 59632.7 34339.7 34757.8 34899.5 36042.9 65419.7 12136.7 14615.8 16130.8 16310.7 16332.6 11268.8 12971.2 13134.4 13136.3 13158.6 15760.1 19065.5 19179.9 19182.9 19446.7 6947.8 7207.9 7341.8 7360.4 7818.4 870.7 916.9 1001.8 1030.9 1091.8 24972.5 29961.7 30030.5 30150.1 30404.4 1052.9 1065.6 1071.7 1082.8 1125.0 15098.7 15653.6 15751.9 15761.0 16047.9 716510.0 734607.0 735754.0 739236.0 739375.0 57340.7 57728.4 57885.1 57899.0 58011.7 1196.0 1367.2 1390.5 1397.1 1400.3 24269.9 29093.6 29498.7 29820.4 30513.5 49551.8 54967.0 56658.4 56800.0 59866.0 548351.5 548713.0 555786.0 556213.0 556730.0 43254.8 43362.0 43381.8 43410.8 43520.3 47049.6 47165.8 47522.9 47530.5 47636.5 39223.0 39308.0 39621.6 39961.2 40561.0 39296.8 39315.4 39409.0 40150.6 41094.6 32614.8 37562.8 38689.4 39028.2 39870.2 33045.7 35254.8 35344.5 35546.3 35648.3 25208.5 25880.5 26206.9 26415.9 26457.5 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - PROCESS | 1943 | [#2] jquery.html Cycles:180 Average:34265.89 Median:12098.53 stddev:95772.62 (791.6%) stddev-sans-first:96007.40 07:15:46 INFO - PROCESS | 1943 | Values: 335.0 376.7 382.2 383.0 403.2 19519.5 19859.2 20149.0 20746.8 20902.8 11748.2 12032.9 15133.8 20348.7 20902.7 5384.0 5595.4 5597.9 5600.7 5612.6 5248.6 5480.6 5519.7 5531.8 5538.9 5510.1 5521.3 5531.2 5532.3 5540.9 5273.7 5514.7 5516.2 5525.5 5535.5 5148.5 5358.5 5386.8 5388.1 5392.4 10305.8 10539.9 11702.4 12953.9 12984.5 2159.4 2163.9 2166.2 2298.6 2836.9 9766.8 10423.5 10483.9 13035.9 14790.9 1826.1 1856.6 1926.1 1932.6 1937.1 98008.0 110575.0 122065.4 123899.0 131492.0 11517.6 11608.4 11732.6 11806.6 12037.2 14503.7 14568.9 14636.4 14812.4 14831.4 6875.8 8583.1 8651.6 8730.1 8803.0 8596.1 8622.3 8650.9 8787.9 8808.8 4469.4 4552.0 4558.3 4618.8 4623.5 1885.6 1901.0 1951.0 1952.2 1952.7 830.9 848.4 856.0 994.9 1001.4 15795.8 20744.4 21444.5 21635.9 21898.5 801.7 911.3 941.4 946.8 949.5 7628.0 10726.5 11400.7 11456.3 11479.5 518546.0 526241.0 528429.0 624907.0 627847.0 141041.3 143125.0 144569.0 150583.2 154151.5 955.4 978.5 1001.0 1004.0 1012.0 18393.8 19255.7 19519.8 19531.6 19597.3 43916.8 44136.1 49679.5 53968.7 56096.2 82215.0 86610.6 86663.1 87369.6 88134.1 8095.5 8113.5 8243.6 8418.0 8457.9 11929.2 13027.3 13206.5 13260.9 13305.5 8416.6 11306.2 11473.8 11663.5 11775.9 9822.5 10862.8 11257.9 11262.3 11615.2 11437.3 11633.7 11900.8 11908.8 11909.3 8033.2 8205.8 8316.7 8356.1 8463.0 9634.4 11297.5 11335.4 11633.3 11739.4 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - PROCESS | 1943 | [#3] mootools.html Cycles:180 Average:5785.24 Median:5028.79 stddev:3280.32 (65.2%) stddev-sans-first:3272.65 07:15:46 INFO - PROCESS | 1943 | Values: 1358.4 1545.1 1670.2 1849.9 1869.5 7926.0 8141.8 8695.4 9318.0 9318.1 7500.2 8724.8 9117.7 9177.1 9182.6 2375.0 2411.5 2415.4 2417.7 2419.4 2395.4 2421.3 2423.8 2431.7 2437.8 2143.7 2295.4 2415.7 2427.7 2437.1 2393.3 2394.5 2402.7 2415.3 2416.7 1963.5 2373.8 2378.3 2383.3 2385.3 9113.0 9154.0 9184.1 9224.9 9242.3 5347.7 5523.3 5527.7 5534.5 5543.3 3633.7 3685.1 3718.7 3737.2 3740.9 1068.7 1072.1 1076.9 1078.2 1084.4 11698.2 11907.4 12027.6 12037.7 12077.8 4081.6 4400.8 4518.4 4748.2 4757.7 9358.2 9447.0 9454.5 9467.9 9471.0 5396.5 5399.5 5405.4 5411.2 5413.2 4495.2 4646.2 4864.5 4986.4 5066.9 3392.5 3851.6 3925.9 3979.8 3988.1 1182.5 1192.2 1203.9 1204.2 1216.3 715.1 757.7 836.6 911.7 946.8 5943.6 5995.5 6033.2 6180.2 6181.6 813.5 941.0 950.2 973.8 992.2 3644.7 3727.4 3919.9 4077.2 4077.7 10763.9 11139.9 11148.5 11166.6 11172.9 10995.5 11055.8 11066.3 11107.4 11111.4 8002.0 8336.4 8370.2 8400.7 8459.6 6001.6 6005.2 6113.6 6129.8 6167.4 10117.3 10163.5 10276.8 10283.4 10365.0 9880.4 10273.7 10328.6 10437.1 10455.2 6460.8 7080.4 7292.3 7650.7 7828.9 8422.5 8604.5 8697.4 8697.7 8704.5 7584.8 7721.4 7749.7 7771.8 7838.6 7425.1 7557.5 7574.2 7608.6 7723.8 6161.7 6390.8 7061.5 7246.6 7266.1 3906.6 4496.7 4990.6 5181.8 5234.7 5072.6 5118.2 5131.4 5202.1 5234.2 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - PROCESS | 1943 | [#4] prototype.html Cycles:180 Average:4626.65 Median:5043.15 stddev:1431.52 (28.4%) stddev-sans-first:1397.56 07:15:46 INFO - PROCESS | 1943 | Values: 262.4 283.2 314.5 314.7 321.3 5028.7 5276.9 5498.4 5529.3 5562.8 4242.5 4662.8 4950.3 5323.5 5452.0 3883.9 3986.9 4071.1 4102.5 4106.1 4128.3 4140.2 4160.0 4175.9 4211.5 3849.3 3859.9 4105.4 4146.9 4179.4 3934.8 4000.5 4049.2 4149.0 4172.0 3565.6 3583.5 3586.7 3588.6 3604.5 5233.4 5271.4 5281.4 5345.0 5360.0 4349.8 4668.7 4746.4 4770.2 4839.1 4752.0 5784.8 5800.0 5846.2 5905.9 3939.0 3948.3 3953.1 3955.8 3958.9 4503.8 5180.9 5230.5 5391.3 5499.9 3613.8 3984.5 3988.5 3991.3 3991.9 3565.1 3841.4 4005.5 4025.5 4045.3 4702.0 4703.2 4731.5 4735.2 4738.7 4425.0 5319.9 5872.3 5892.3 5913.0 1359.6 1372.7 1374.8 1375.3 1384.9 783.9 820.2 838.6 842.5 843.1 4527.8 4715.3 4863.2 4982.8 5409.0 5906.8 5946.3 5955.7 5981.9 5990.9 3839.0 4567.7 5029.4 5381.0 5443.3 2693.4 3139.1 3141.3 3144.3 3156.8 6099.9 6111.4 6130.2 6175.0 6198.7 5410.3 5532.8 5640.3 5861.0 6145.7 6111.5 6123.7 6129.8 6161.8 6189.5 4673.1 4795.0 5589.0 5902.7 5907.0 5627.5 5830.3 5844.9 5845.4 5862.4 5056.8 5570.4 5583.7 6084.0 6153.9 3708.7 3754.5 3796.9 3829.8 3971.3 4767.5 5989.1 6063.7 6072.9 6087.4 4871.5 4885.1 5595.9 5815.9 5849.2 5475.7 5740.6 5830.0 5837.9 5868.4 5440.9 5480.0 5705.0 5718.2 5734.6 4842.8 4983.3 5459.4 5773.8 5787.3 5746.8 5786.2 5795.0 5797.5 5809.3 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - PROCESS | 1943 | [#5] yui.html Cycles:180 Average:26063.23 Median:13185.01 stddev:43351.21 (328.8%) stddev-sans-first:43430.98 07:15:46 INFO - PROCESS | 1943 | Values: 694.7 713.7 782.8 809.3 815.1 15054.2 15867.0 15882.8 15899.5 15932.4 14270.6 14290.0 14293.1 14338.4 14377.8 660.1 685.1 817.4 827.8 852.0 764.7 851.5 855.0 863.5 867.3 892.3 917.8 919.2 920.6 922.5 902.3 913.0 913.6 914.5 914.8 663.1 669.9 670.4 675.0 677.0 15275.6 15398.2 15405.9 15408.8 15441.0 11519.4 13717.4 14787.9 14792.2 14988.0 11668.8 12038.7 12105.4 12145.5 12468.6 3739.7 3789.3 3807.5 3829.6 3866.2 119353.0 120880.4 122308.0 122694.0 122704.4 10862.3 11062.3 11183.2 11229.6 11298.0 21624.4 22468.9 22664.8 22745.9 22776.4 8187.1 8218.3 8230.9 8347.0 8402.4 4490.9 4525.7 4594.3 4596.8 4688.2 3593.6 3657.0 3779.9 3780.1 3791.2 718.2 723.4 726.9 727.4 728.5 520.2 582.5 616.5 628.2 641.4 9663.8 9818.0 9849.7 9862.0 9873.1 562.4 567.0 582.5 619.9 670.4 4298.4 4787.6 4788.8 4825.6 4864.2 177572.0 178648.0 178872.0 181702.0 182349.0 115343.4 127379.0 131765.3 143470.0 148654.0 100698.5 104721.5 114662.0 115017.0 130976.7 9614.6 9931.9 9935.8 9991.2 10014.2 58215.7 59691.9 61042.0 65323.0 66407.0 66309.0 67405.3 79324.6 93852.6 97545.0 12922.1 13110.7 13138.7 13140.1 13385.7 13379.9 13472.7 13565.0 13897.2 14192.3 13823.9 13849.2 13932.7 13956.9 14419.8 13731.2 13886.2 14120.4 14329.1 14639.9 10518.9 10846.9 12267.0 13245.9 14374.5 10940.6 11368.5 11581.8 11827.6 12419.6 11494.0 11678.4 11882.8 11897.9 11978.1 07:15:46 INFO - PROCESS | 1943 | -------- Summary: end -------- 07:15:46 INFO - PROCESS | 1943 | 07:15:46 INFO - TEST-INFO | 1943: exit 0 07:15:46 INFO - TEST-OK | dromaeo_css | took 1113758ms 07:15:46 INFO - TEST-START | kraken 07:15:46 INFO - operating with platform_type : mac_ 07:15:46 INFO - Initialising browser for kraken test... 07:15:46 INFO - TEST-INFO | started process 1947 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/tmpu7uO7K/profile http://localhost:49782/getInfo.html) 07:15:49 INFO - PROCESS | 1947 | __metrics Screen width/height:1600/1200 07:15:49 INFO - PROCESS | 1947 | colorDepth:24 07:15:49 INFO - PROCESS | 1947 | Browser inner width/height: 1024/663 07:15:49 INFO - PROCESS | 1947 | __metrics 07:15:49 ERROR - PROCESS | 1947 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 07:15:50 INFO - TEST-INFO | 1947: exit 0 07:15:50 INFO - Browser initialized. 07:15:50 INFO - Running cycle 1/1 for kraken test... 07:15:50 INFO - TEST-INFO | started process 1949 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/tmpu7uO7K/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:16:02 INFO - PROCESS | 1949 | RSS: Main: 238321664 07:16:02 INFO - PROCESS | 1949 | 07:16:05 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49782/tests/kraken/driver.html?testName=audio-beat-detection) 07:16:06 INFO - PROCESS | 1949 | RSS: Main: 248692736 07:16:06 INFO - PROCESS | 1949 | 07:16:09 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49782/tests/kraken/driver.html?testName=audio-dft) 07:16:09 INFO - PROCESS | 1949 | RSS: Main: 256077824 07:16:09 INFO - PROCESS | 1949 | 07:16:13 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49782/tests/kraken/driver.html?testName=audio-fft) 07:16:13 INFO - PROCESS | 1949 | RSS: Main: 256937984 07:16:13 INFO - PROCESS | 1949 | 07:16:15 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49782/tests/kraken/driver.html?testName=audio-oscillator) 07:16:16 INFO - PROCESS | 1949 | RSS: Main: 256856064 07:16:16 INFO - PROCESS | 1949 | 07:16:18 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49782/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:16:18 INFO - PROCESS | 1949 | RSS: Main: 256942080 07:16:18 INFO - PROCESS | 1949 | 07:16:21 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49782/tests/kraken/driver.html?testName=imaging-darkroom) 07:16:22 INFO - PROCESS | 1949 | RSS: Main: 257630208 07:16:22 INFO - PROCESS | 1949 | 07:16:25 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49782/tests/kraken/driver.html?testName=imaging-desaturate) 07:16:26 INFO - PROCESS | 1949 | RSS: Main: 257785856 07:16:26 INFO - PROCESS | 1949 | 07:16:28 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49782/tests/kraken/driver.html?testName=json-parse-financial) 07:16:29 INFO - PROCESS | 1949 | RSS: Main: 257953792 07:16:29 INFO - PROCESS | 1949 | 07:16:31 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49782/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:16:31 INFO - PROCESS | 1949 | RSS: Main: 257343488 07:16:31 INFO - PROCESS | 1949 | 07:16:33 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49782/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:16:34 INFO - PROCESS | 1949 | RSS: Main: 257507328 07:16:34 INFO - PROCESS | 1949 | 07:16:36 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49782/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:16:37 INFO - PROCESS | 1949 | RSS: Main: 257490944 07:16:37 INFO - PROCESS | 1949 | 07:16:40 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49782/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:16:40 INFO - PROCESS | 1949 | RSS: Main: 257564672 07:16:40 INFO - PROCESS | 1949 | 07:16:43 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49782/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:16:44 INFO - PROCESS | 1949 | RSS: Main: 257933312 07:16:44 INFO - PROCESS | 1949 | 07:16:45 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:49782/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49782/tests/kraken/driver.html?testName=ai-astar) 07:16:46 INFO - PROCESS | 1949 | RSS: Main: 259248128 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | __start_tp_report 07:16:46 INFO - PROCESS | 1949 | _x_x_mozilla_page_load 07:16:46 INFO - PROCESS | 1949 | _x_x_mozilla_page_load_details 07:16:46 INFO - PROCESS | 1949 | |i|pagename|runs| 07:16:46 INFO - PROCESS | 1949 | |0;ai-astar;106;117;117;118;123;116;116;118;118;117 07:16:46 INFO - PROCESS | 1949 | |1;audio-beat-detection;139;110;104;160;137;146;98;138;175;144 07:16:46 INFO - PROCESS | 1949 | |2;audio-dft;204;199;208;227;199;198;206;240;194;194 07:16:46 INFO - PROCESS | 1949 | |3;audio-fft;84;58;61;87;61;59;58;58;79;57 07:16:46 INFO - PROCESS | 1949 | |4;audio-oscillator;84;73;103;92;70;71;93;101;101;118 07:16:46 INFO - PROCESS | 1949 | |5;imaging-gaussian-blur;88;87;88;103;136;80;135;132;120;86 07:16:46 INFO - PROCESS | 1949 | |6;imaging-darkroom;118;95;96;95;95;95;95;104;94;95 07:16:46 INFO - PROCESS | 1949 | |7;imaging-desaturate;91;94;95;91;96;91;102;94;90;93 07:16:46 INFO - PROCESS | 1949 | |8;json-parse-financial;55;55;56;58;58;60;61;60;60;59 07:16:46 INFO - PROCESS | 1949 | |9;json-stringify-tinderbox;68;75;68;82;75;76;67;88;103;93 07:16:46 INFO - PROCESS | 1949 | |10;stanford-crypto-aes;85;84;85;87;85;84;86;87;94;87 07:16:46 INFO - PROCESS | 1949 | |11;stanford-crypto-ccm;137;159;130;136;133;156;160;158;186;142 07:16:46 INFO - PROCESS | 1949 | |12;stanford-crypto-pbkdf2;165;170;192;171;167;178;170;150;197;152 07:16:46 INFO - PROCESS | 1949 | |13;stanford-crypto-sha256-iterative;68;65;68;68;69;65;66;66;67;66 07:16:46 INFO - PROCESS | 1949 | __end_tp_report 07:16:46 INFO - PROCESS | 1949 | __start_cc_report 07:16:46 INFO - PROCESS | 1949 | _x_x_mozilla_cycle_collect,954 07:16:46 INFO - PROCESS | 1949 | __end_cc_report 07:16:46 INFO - PROCESS | 1949 | __startTimestamp1474640206121__endTimestamp 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | ------- Summary: start ------- 07:16:46 INFO - PROCESS | 1949 | Number of tests: 14 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#0] ai-astar Cycles:10 Average:116.60 Median:117.50 stddev:4.22 (3.6%) stddev-sans-first:2.11 07:16:46 INFO - PROCESS | 1949 | Values: 106.0 117.0 117.0 118.0 123.0 116.0 116.0 118.0 118.0 117.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#1] audio-beat-detection Cycles:10 Average:135.10 Median:145.00 stddev:24.52 (16.9%) stddev-sans-first:25.97 07:16:46 INFO - PROCESS | 1949 | Values: 139.0 110.0 104.0 160.0 137.0 146.0 98.0 138.0 175.0 144.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#2] audio-dft Cycles:10 Average:206.90 Median:205.00 stddev:15.08 (7.4%) stddev-sans-first:15.96 07:16:46 INFO - PROCESS | 1949 | Values: 204.0 199.0 208.0 227.0 199.0 198.0 206.0 240.0 194.0 194.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#3] audio-fft Cycles:10 Average:66.20 Median:61.00 stddev:12.04 (19.7%) stddev-sans-first:10.92 07:16:46 INFO - PROCESS | 1949 | Values: 84.0 58.0 61.0 87.0 61.0 59.0 58.0 58.0 79.0 57.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#4] audio-oscillator Cycles:10 Average:90.60 Median:72.00 stddev:15.95 (22.2%) stddev-sans-first:16.74 07:16:46 INFO - PROCESS | 1949 | Values: 84.0 73.0 103.0 92.0 70.0 71.0 93.0 101.0 101.0 118.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#5] imaging-gaussian-blur Cycles:10 Average:105.50 Median:83.00 stddev:22.86 (27.5%) stddev-sans-first:23.36 07:16:46 INFO - PROCESS | 1949 | Values: 88.0 87.0 88.0 103.0 136.0 80.0 135.0 132.0 120.0 86.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#6] imaging-darkroom Cycles:10 Average:98.20 Median:95.00 stddev:7.52 (7.9%) stddev-sans-first:3.04 07:16:46 INFO - PROCESS | 1949 | Values: 118.0 95.0 96.0 95.0 95.0 95.0 95.0 104.0 94.0 95.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#7] imaging-desaturate Cycles:10 Average:93.70 Median:93.50 stddev:3.53 (3.8%) stddev-sans-first:3.61 07:16:46 INFO - PROCESS | 1949 | Values: 91.0 94.0 95.0 91.0 96.0 91.0 102.0 94.0 90.0 93.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#8] json-parse-financial Cycles:10 Average:58.20 Median:59.50 stddev:2.20 (3.7%) stddev-sans-first:2.01 07:16:46 INFO - PROCESS | 1949 | Values: 55.0 55.0 56.0 58.0 58.0 60.0 61.0 60.0 60.0 59.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#9] json-stringify-tinderbox Cycles:10 Average:79.50 Median:75.50 stddev:11.96 (15.8%) stddev-sans-first:11.94 07:16:46 INFO - PROCESS | 1949 | Values: 68.0 75.0 68.0 82.0 75.0 76.0 67.0 88.0 103.0 93.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#10] stanford-crypto-aes Cycles:10 Average:86.40 Median:86.50 stddev:2.91 (3.4%) stddev-sans-first:3.05 07:16:46 INFO - PROCESS | 1949 | Values: 85.0 84.0 85.0 87.0 85.0 84.0 86.0 87.0 94.0 87.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#11] stanford-crypto-ccm Cycles:10 Average:149.70 Median:157.00 stddev:17.30 (11.0%) stddev-sans-first:17.73 07:16:46 INFO - PROCESS | 1949 | Values: 137.0 159.0 130.0 136.0 133.0 156.0 160.0 158.0 186.0 142.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.20 Median:170.50 stddev:14.99 (8.8%) stddev-sans-first:15.73 07:16:46 INFO - PROCESS | 1949 | Values: 165.0 170.0 192.0 171.0 167.0 178.0 170.0 150.0 197.0 152.0 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - PROCESS | 1949 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.80 Median:67.50 stddev:1.40 (2.1%) stddev-sans-first:1.41 07:16:46 INFO - PROCESS | 1949 | Values: 68.0 65.0 68.0 68.0 69.0 65.0 66.0 66.0 67.0 66.0 07:16:46 INFO - PROCESS | 1949 | -------- Summary: end -------- 07:16:46 INFO - PROCESS | 1949 | 07:16:46 INFO - TEST-INFO | 1949: exit 0 07:16:46 INFO - TEST-OK | kraken | took 60120ms 07:16:46 INFO - SUITE-END | took 1173s 07:16:47 INFO - Completed test suite (00:19:34) 07:16:47 INFO - javascript benchmark 07:16:47 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7376.78833898533, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2816.4930312543734, 2839.063109173973, 3209.358128374325, 3257.6742325767414, 3289.9307724989376, 4694.366260554824, 5711.086226203808, 5814.883702325951, 5818.447247511485, 5832.416758324176, 5780.988327042772, 5843.386444423328, 5873.794417195399, 5908.556858235639, 5926.229590153274, 5323.334583177112, 5347.786088556453, 5365.114756065264, 5382.730863456831, 5384.5692344612335, 5369.087255166612, 5375.139977603584, 5381.81163659272, 5390.649607775502, 5455.972720136414, 5207.947920520804, 5238.030964271603, 5358.142697168454, 5372.892542149155, 5383.138697808351, 5148.974255128719, 5245.160774276116, 5284.101702710548, 5300.443453437372, 5300.893982120375, 5226.73866306687, 5251.291075704769, 5261.552768014723, 5303.496167864047, 5362.678239305654, 5521.779128834882, 5843.5325173985975, 5861.17943487912, 5970.641761494324, 5975.641461512323, 6137.478314343286, 6139.798803208747, 6167.951448253808, 6199.225096862892, 6207.068939659042, 6226.470749986257, 6266.780662676784, 6310.116583678288, 6342.0, 6359.618422894641, 5865.648061116347, 5998.970005149947, 6003.339632640406, 6006.0, 6033.5474839387225, 6287.0, 6385.840353991188, 6393.520485963571, 6408.423241908157, 6413.967930160413, 6281.78013769525, 6288.402601752918, 6294.339094395114, 6299.905501417483, 6317.557770956081, 6112.786052488142, 6132.845047373359, 6255.093011513305, 6269.623822570569, 6299.590526615755, 4706.741129237925, 6257.937420625826, 6266.436020758154, 6288.968555157287, 6304.432601065926, 6231.189945307172, 6263.498920086382, 6264.029075493215, 6278.434940855345, 6282.623042617458, 4864.73243971585, 4945.629077819178, 5008.348914641147, 5020.974895125574, 5032.748362581856, 4183.205191013698, 4423.977880110643, 4447.955520444754, 4449.755263460476, 4513.232750432434, 4667.8366257181515, 5924.61490003157, 5984.7606095756555, 5990.281166260077, 6001.459868611846, 6170.938290617126, 6290.591111577733, 6292.937070629327, 6298.748050077946, 6313.305536390993, 5258.605604579672, 5803.303603567599, 5857.648541087463, 5926.111083337534, 5952.880942381128, 4469.620082293041, 4602.803271149525, 4616.722996620214, 5495.395506494282, 5510.311211098613, 6345.471224025856, 6383.0, 6402.519811014193, 6434.774782882577, 6443.710033048524, 4834.0, 6022.819315420545, 6045.78839740607, 6145.525073982301, 6161.969190154021, 6351.047342898602, 6395.488360931207, 6405.487560995016, 6423.518236132215, 6429.54993150475, 6206.286277078013, 6222.346653601307, 6239.625622462485, 6247.875042499216, 6262.248530176408, 6049.032154855378, 6105.419985101408, 6131.202943617302, 6263.123162757309, 6263.74945002213, 6141.486007784364, 6144.371741488599, 6183.505319574333, 6194.845128871814, 6218.906716399167, 6172.6913654318005, 6185.536084793748, 6187.381261873777, 6201.503879689524, 6256.593321434092, 5703.201551782837, 5960.284765828128, 6027.457528822427, 6125.295591007091, 6136.754529818757, 5212.50481204285, 5282.498162674539, 6086.995645718407, 6128.717018009349, 6269.247690277013, 4977.726225057657, 6120.54095942815, 6122.112293717475, 6143.877122457615, 6154.1999540059505], "value": 5699.704253052499, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [462.58598554293906, 505.9544640982312, 527.5594878276642, 527.8231792349563, 542.4141926719144, 37851.0, 41141.38287925684, 41168.38247426287, 41229.79385103078, 41247.79376103119, 41458.0, 41911.58088419122, 42007.57992420075, 42183.0, 42193.0, 9688.224942004657, 9827.65603203888, 9907.752306192331, 9922.702318930444, 9933.205343572497, 9787.363821351624, 9833.803323933516, 9874.061964113434, 9883.604655813759, 9917.0, 9918.3057185997, 9923.007699230091, 9937.45344006083, 9943.701688949342, 9957.651482198124, 9781.657641982532, 9839.655612053615, 9842.852357214575, 9856.50717464124, 9872.35829671069, 9628.566714497865, 9704.369216001009, 9722.708318750378, 9775.706728798148, 9797.167240784542, 35170.94487165389, 35494.64505354939, 35516.0, 35530.46704299437, 35549.64450355489, 3160.1783536280504, 3333.4999750037687, 3347.2468694543777, 3351.597808263024, 3769.1542288557216, 29664.851675741484, 30117.548236776467, 30484.390312193853, 30710.846445767627, 31177.844110779526, 3165.446046941776, 3264.836758162106, 3282.491213861855, 3287.211069343364, 3299.9010029699148, 264426.3557364421, 314054.0, 328894.3555282208, 331429.3428532866, 331703.0, 58730.706346467996, 59348.0, 59478.10782838261, 59504.404955950755, 59632.70183649054, 34339.656603434145, 34757.826210868785, 34899.4765078524, 36042.918712438666, 65419.67290163519, 12136.69658258533, 14615.78076328856, 16130.75803862943, 16310.673786524441, 16332.591685207964, 11268.830967535494, 12971.221726696429, 13134.408951597201, 13136.34318284101, 13158.60524184276, 15760.133192674284, 19065.523361915784, 19179.94510301947, 19182.944938028544, 19446.70829937552, 6947.826304342432, 7207.918812178215, 7341.816454588678, 7360.447966402541, 7818.4136189785995, 870.6691457246333, 916.867054277126, 1001.8146642871092, 1030.8711411073616, 1091.8089334366455, 24972.500549988898, 29961.70038299633, 30030.549541756893, 30150.09549713512, 30404.391912162075, 1052.884182739898, 1065.648336049102, 1071.6624263357019, 1082.826747720361, 1124.971875703114, 15098.698026039418, 15653.608659783597, 15751.921240393725, 15760.975536590086, 16047.919760401357, 716510.0, 734607.0, 735754.0, 739236.0, 739375.0, 57340.713296434085, 57728.422715773144, 57885.13172302419, 57899.0, 58011.70994145087, 1196.0, 1367.2070199284392, 1390.5272207449314, 1397.1337770582304, 1400.3418393355107, 24269.878650606635, 29093.563596545646, 29498.705012949595, 29820.403591927607, 30513.54229686601, 49551.752241238566, 54967.0, 56658.43341566531, 56800.0, 59866.0, 548351.5164848301, 548713.0, 555786.0, 556213.0, 556730.0, 43254.783726081165, 43362.0, 43381.78309108434, 43410.78294608507, 43520.34719479147, 47049.588512344686, 47165.764171178926, 47522.90481720847, 47530.52469475261, 47636.5236347646, 39223.01942451348, 39308.0, 39621.60378396179, 39961.2007759849, 40560.98597535085, 39296.80351598224, 39315.410268845415, 39409.0, 40150.594729185505, 41094.58905410908, 32614.83692581522, 37562.81218593889, 38689.41965870571, 39028.21943561056, 39870.20259594734, 33045.66954330522, 35254.823725882234, 35344.46983295201, 35546.28907421889, 35648.28703425969, 25208.495830082928, 25880.48239035171, 26206.86896565505, 26415.94336226606, 26457.470850582496], "value": 19850.048780824523, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [334.9547811045509, 376.67982215117155, 382.21073483257055, 382.9674477669398, 403.2197697455424, 19519.512012199702, 19859.20563177473, 20149.0, 20746.792532074694, 20902.790972090275, 11748.236364636292, 12032.879671203285, 15133.848661513382, 20348.677335973152, 20902.686459703116, 5384.030874442608, 5595.440455954413, 5597.916031259534, 5600.719964001804, 5612.635178713391, 5248.632595718302, 5480.6437581557275, 5519.69641669708, 5531.806386776464, 5538.9169162462595, 5510.063289240818, 5521.337439507245, 5531.197976293435, 5532.336119665646, 5540.861478463051, 5273.736313184345, 5514.6691198528015, 5516.172574113875, 5525.502704756551, 5535.501804837564, 5148.510891465305, 5358.544523715489, 5386.78452861885, 5388.137897936312, 5392.379876314235, 10305.793884122275, 10539.894601053968, 11702.414879256003, 12953.935230323883, 12984.480620775157, 2159.4169574214875, 2163.891805409723, 2166.2093335932427, 2298.5981844767416, 2836.928660317207, 9766.755831104208, 10423.478826058743, 10483.895161048444, 13035.86964130356, 14790.852091479055, 1826.1234607388394, 1856.60083082138, 1926.1236137557378, 1932.5651728361147, 1937.060525645061, 98008.0, 110575.0, 122065.38967305106, 123899.0, 131492.0, 11517.596884109016, 11608.361540115206, 11732.648020559396, 11806.586769463027, 12037.217580857392, 14503.709925801424, 14568.85431145675, 14636.414543418357, 14812.407503699947, 14831.406743730346, 6875.7937261882225, 8583.141685831491, 8651.610677519528, 8730.083341249077, 8802.955985220033, 8596.097409772008, 8622.267107295826, 8650.913490865136, 8787.912120878837, 8808.823823523493, 4469.351943968171, 4551.977240113778, 4558.293464513005, 4618.838340658061, 4623.468301145344, 1885.6323017011825, 1900.9809901900803, 1950.951226219356, 1952.248384372027, 1952.66804643211, 830.9459885107449, 848.4442690038035, 856.0, 994.880614326271, 1001.369137443406, 15795.842041579437, 20744.377668669964, 21444.463888402915, 21635.891820540797, 21898.452538686342, 801.7314199743151, 911.3301723233418, 941.3692825806589, 946.8070231508349, 949.5442187749919, 7627.970224019798, 10726.517306721216, 11400.714982125513, 11456.312621242752, 11479.483423245974, 518546.0, 526241.0, 528429.0, 624907.0, 627847.0, 141041.29479352536, 143125.0, 144569.0, 150583.24708376607, 154151.50051535887, 955.4028732042474, 978.4765150644371, 1000.9599616015278, 1004.0411407106196, 1012.0284526854302, 18393.81606183921, 19255.748376355492, 19519.8048019518, 19531.60936781285, 19597.31409400664, 43916.78041609772, 44136.11727765491, 49679.50961471162, 53968.65078372915, 56096.15855762248, 82215.0, 86610.56694716486, 86663.13336866803, 87369.56315218384, 88134.11865881259, 8095.473794203358, 8113.472624279403, 8243.629036693483, 8418.0, 8457.942757155355, 11929.164958452826, 13027.348632568144, 13206.471741130246, 13260.933695331461, 13305.534306299232, 8416.621252043795, 11306.152038597302, 11473.770524589629, 11663.533458661559, 11775.882241177478, 9822.5088745561, 10862.782744344911, 11257.943710281395, 11262.324260544394, 11615.24500907472, 11437.256578322382, 11633.709157271136, 11900.821487677866, 11908.821367679666, 11909.344986025852, 8033.236842500187, 8205.83588328242, 8316.708915187939, 8356.080831108451, 8463.0, 9634.421934683942, 11297.491612877277, 11335.376554289263, 11633.302001879914, 11739.354335511287], "value": 9313.459540948521, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1358.449827819733, 1545.0652355325028, 1670.2316934210262, 1849.9445016649488, 1869.476546566961, 7925.9603701981405, 8141.837163256731, 8695.39132260742, 9318.0, 9318.114779095984, 7500.174980752113, 8724.781880452992, 9117.726468205949, 9177.128172823572, 9182.632694692204, 2375.0381095656285, 2411.46947671512, 2415.4082249848725, 2417.746136655652, 2419.383057320381, 2395.401149712572, 2421.33413311339, 2423.781859632633, 2431.7081950166007, 2437.7684120008657, 2143.721316228888, 2295.380247333219, 2415.722191947922, 2427.66012758214, 2437.098273638756, 2393.270052633946, 2394.461246219604, 2402.6876506054277, 2415.263344679872, 2416.673749043874, 1963.4600484866633, 2373.8219633527556, 2378.2865140457966, 2383.2611890313883, 2385.260569223546, 9112.997570267265, 9154.0, 9184.081591840762, 9224.8616270756, 9242.306826988002, 5347.679139251657, 5523.28197334344, 5527.695976721278, 5534.501894829485, 5543.334799824047, 3633.6729694327637, 3685.1339935115225, 3718.6653201211752, 3737.1591391936868, 3740.8503659853845, 1068.668712699058, 1072.1208608940594, 1076.9030787229108, 1078.1698092468835, 1084.3927400655657, 11698.239614425034, 11907.404629768564, 12027.639170824888, 12037.699057523545, 12077.818832717605, 4081.6326530612387, 4400.75795831226, 4518.367428559938, 4748.169070412664, 4757.714537127784, 9358.157765800974, 9447.0, 9454.527273636291, 9467.90532094684, 9471.0, 5396.460353964572, 5399.514043736082, 5405.4324295949145, 5411.188321751769, 5413.160960051198, 4495.21333766596, 4646.186917289461, 4864.489228631013, 4986.401631804207, 5066.949330506722, 3392.508086327469, 3851.557070936878, 3925.8822235332987, 3979.786165219578, 3988.062805240766, 1182.479708928069, 1192.1595275330872, 1203.8555373355077, 1204.1931905623253, 1216.2763155922212, 715.1239731329081, 757.7007082202499, 836.6026137584598, 911.6854685133618, 946.8437707778139, 5943.58394912352, 5995.490383317467, 6033.215681961405, 6180.196574445384, 6181.567290289637, 813.520023186311, 940.9529523523796, 950.1543626172573, 973.8490533967247, 992.2310209587628, 3644.7243464787643, 3727.38498147808, 3919.9020024499614, 4077.1845630873945, 4077.6747557044077, 10763.892361076445, 11139.944300278446, 11148.498317575566, 11166.553337866557, 11172.938570835757, 10995.450227488594, 11055.834162487568, 11066.28069175501, 11107.38909359993, 11111.38887361203, 8001.959990200128, 8336.416450848383, 8370.246677799027, 8400.705975290835, 8459.619317130744, 6001.609895356788, 6005.159277701213, 6113.572049956639, 6129.785457508966, 6167.444929956326, 10117.29178957466, 10163.54264058134, 10276.794464110826, 10283.43441110746, 10365.01532354425, 9880.407175569202, 10273.74315642115, 10328.638497652546, 10437.060664540228, 10455.215858810467, 6460.772453233871, 7080.362767350963, 7292.343689067797, 7650.73222437212, 7828.921710783047, 8422.494650321001, 8604.48373097616, 8697.434666746642, 8697.652093916426, 8704.477731336141, 7584.8483030340185, 7721.382289416721, 7749.7287594933905, 7771.844563108819, 7838.608069596383, 7425.146108197627, 7557.508761930457, 7574.166841647525, 7608.619569021416, 7723.806904827425, 6161.691915404302, 6390.808275751735, 7061.540999834994, 7246.6376681164675, 7266.091738532684, 3906.570277269555, 4496.662750293675, 4990.632598556969, 5181.766820493162, 5234.712090835041, 5072.59419246452, 5118.206677964921, 5131.409887862944, 5202.115640341075, 5234.24103504982], "value": 4621.633470384017, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [262.39387015993054, 283.2451516707973, 314.48110617481166, 314.70103401768324, 321.27712646545257, 5028.698278103317, 5276.92084618731, 5498.422665620113, 5529.253550770644, 5562.833115006551, 4242.512111107224, 4662.787675204446, 4950.252609801559, 5323.467653234675, 5451.972740136293, 3883.9029024274337, 3986.8604598839047, 4071.084006098634, 4102.466679331683, 4106.117184805266, 4128.318827393477, 4140.213359461693, 4159.958400415987, 4175.937360939588, 4211.452511173543, 3849.2878817418728, 3859.8842034738864, 4105.384192371138, 4146.854860079898, 4179.3939878717565, 3934.8426062957446, 4000.4599379084034, 4049.2104039712267, 4148.962759310172, 4171.957010747313, 3565.5899571549085, 3583.5341405617364, 3586.6951309138494, 3588.6052534221217, 3604.4593311003296, 5233.398159211702, 5271.42014378418, 5281.445448227919, 5345.0, 5360.0, 4349.847755328548, 4668.743219122947, 4746.359241502422, 4770.16522108633, 4839.104765618336, 4752.004158253541, 5784.768609255625, 5799.971000145015, 5846.2230440540825, 5905.911411328833, 3939.0, 3948.2893079245723, 3953.09078911849, 3955.8330292563473, 3958.9010274743073, 4503.752293623849, 5180.870478238036, 5230.509304848138, 5391.32608423947, 5499.917501237444, 3613.7831730095754, 3984.5218573770753, 3988.541317748438, 3991.341428664296, 3991.92016159681, 3565.1265439967374, 3841.442990766379, 4005.4792876926394, 4025.456563363967, 4045.292073887058, 4701.9529804701515, 4703.200455922433, 4731.4558825735485, 4735.242361222188, 4738.668293219442, 4424.977875110604, 5319.898640037163, 5872.265966754156, 5892.322382925932, 5913.0, 1359.6193065941552, 1372.7048684532874, 1374.762713557806, 1375.2917247617486, 1384.9376778045012, 783.9372850171973, 820.2248874813245, 838.5890913452487, 842.5113434208145, 843.0978852627629, 4527.7736113194205, 4715.255355518411, 4863.197572400585, 4982.750862456863, 5408.972955135199, 5906.844001939261, 5946.316173640001, 5955.659976505338, 5981.850453738604, 5990.850228744316, 3839.00371806659, 4567.734070139866, 5029.446760856303, 5380.973095134499, 5443.258157389677, 2693.3805224798407, 3139.1479027373957, 3141.2723002348616, 3144.292534179837, 3156.779025468195, 6099.9390006099375, 6111.419415155553, 6130.2030736004035, 6174.969125154345, 6198.721057552421, 5410.296661433988, 5532.838103998205, 5640.307907627695, 5861.0, 6145.723442445101, 6111.502681842888, 6123.7244324006415, 6129.785457508877, 6161.8125565424525, 6189.50483961282, 4673.135469938073, 4795.0, 5588.972055139861, 5902.734376952962, 5906.9916228482525, 5627.465390787868, 5830.250924722651, 5844.94155058444, 5845.41545845412, 5862.443067908542, 5056.84829455117, 5570.359408668055, 5583.664980101207, 6083.969580152071, 6153.892299386153, 3708.7218458616253, 3754.5494540655295, 3796.867109651149, 3829.7893615851394, 3971.2653159165648, 4767.4994125617695, 5989.071693887455, 6063.666498342457, 6072.8785424292155, 6087.447700836436, 4871.5128487151005, 4885.071836351082, 5595.944040559542, 5815.883682326415, 5849.239598852122, 5475.698836564027, 5740.569457290803, 5829.988653914393, 5837.854053648693, 5868.383819699041, 5440.945590544044, 5480.0, 5705.0, 5718.170185540587, 5734.627249228954, 4842.806287748592, 4983.277424773315, 5459.426760190282, 5773.826785196451, 5787.276590426197, 5746.798862039808, 5786.1811204604755, 5795.0, 5797.4782269595935, 5809.257222833217], "value": 4162.1506781522485, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [694.6974422956953, 713.7180813578636, 782.7651704488655, 809.2918696140877, 815.140027271229, 15054.247287635615, 15867.0, 15882.76175857363, 15899.52301430956, 15932.442364517245, 14270.643233919158, 14290.0, 14293.070950388217, 14338.354774035168, 14377.78433323501, 660.0824853453703, 685.099094690483, 817.3706246190415, 827.7765003449065, 851.9659213631447, 764.7246991083206, 851.4848516647432, 854.974350769478, 863.4905405810571, 867.3104881619128, 892.3396686452011, 917.8485549884294, 919.1727445299217, 920.585736418611, 922.5479515037616, 902.2601466797229, 912.9771755706128, 913.6345461815293, 914.5381582300962, 914.7713071732067, 663.1081195791653, 669.9095622091004, 670.4368330602317, 675.0212192321154, 676.9864602707968, 15275.618109547238, 15398.153101579408, 15405.922970385189, 15408.845911540966, 15440.996335238286, 11519.36643484608, 13717.382717777724, 14787.852121478863, 14792.18642974636, 14988.0, 11668.76662466746, 12038.69903252417, 12105.394730263451, 12145.453454594564, 12468.563600273947, 3739.66343029126, 3789.2610940866543, 3807.4859893914245, 3829.5978922213326, 3866.2267546490534, 119353.0, 120880.39559802233, 122308.0, 122694.0, 122704.38647806793, 10862.34825910448, 11062.280951738112, 11183.217174797848, 11229.606963756392, 11298.039666628265, 21624.351269461942, 22468.887655561946, 22664.773352266267, 22745.886270568542, 22776.43058923507, 8187.14034526849, 8218.301444377175, 8230.876536851953, 8347.04009038956, 8402.369822263354, 4490.910181796346, 4525.660575456854, 4594.287885377772, 4596.793144308447, 4688.249880019249, 3593.586737525166, 3657.0, 3779.9244015119543, 3780.092777733379, 3791.2038471920655, 718.1848601836848, 723.4068064187315, 726.8618962397128, 727.3817255332925, 728.4500202347194, 520.1599416941611, 582.4845012164266, 616.4540447950027, 628.2210059526246, 641.377863472431, 9663.806723865624, 9818.0, 9849.704508864745, 9861.950690246646, 9873.111419972238, 562.4291344285554, 567.0, 582.5106910195456, 619.8760247950428, 670.3531092495765, 4298.376735373354, 4787.640926930494, 4788.760561971888, 4825.6139508839915, 4864.197407427735, 177572.0, 178648.0, 178872.0, 181702.0, 182349.0, 115343.42328288473, 127379.0, 131765.3411732935, 143470.0, 148654.0, 100698.49650751699, 104721.47639261755, 114662.0, 115017.0, 130976.69023309836, 9614.615415383307, 9931.900680993098, 9935.801283974135, 9991.200703943521, 10014.188932632558, 58215.70892145512, 59691.92040278236, 61042.0, 65323.0, 66407.0, 66309.0, 67405.3259467399, 79324.60337698275, 93852.59221111552, 97545.0, 12922.095453318178, 13110.672233194246, 13138.737225255632, 13140.145890517086, 13385.66535836612, 13379.933100334825, 13472.663183420493, 13565.0, 13897.16617002983, 14192.290385480479, 13823.930880345533, 13849.16904985704, 13932.651683707989, 13956.860431395557, 14419.78370324467, 13731.239439419462, 13886.236257005557, 14120.364583593968, 14329.140251584939, 14639.92680036593, 10518.947405262925, 10846.891531084588, 12267.018638509076, 13245.933770331087, 14374.496892608708, 10940.577724895713, 11368.54525818958, 11581.82627260575, 11827.586034488751, 12419.627411177678, 11494.0, 11678.416079196177, 11882.76234475323, 11897.940510297392, 11978.101642376681], "value": 7949.161160436801, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1524.6000000000004, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 117.0, 117.0, 118.0, 123.0, 116.0, 116.0, 118.0, 118.0, 117.0], "value": 116.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 110.0, 104.0, 160.0, 137.0, 146.0, 98.0, 138.0, 175.0, 144.0], "value": 135.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [204.0, 199.0, 208.0, 227.0, 199.0, 198.0, 206.0, 240.0, 194.0, 194.0], "value": 206.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 58.0, 61.0, 87.0, 61.0, 59.0, 58.0, 58.0, 79.0, 57.0], "value": 66.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 73.0, 103.0, 92.0, 70.0, 71.0, 93.0, 101.0, 101.0, 118.0], "value": 90.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 87.0, 88.0, 103.0, 136.0, 80.0, 135.0, 132.0, 120.0, 86.0], "value": 105.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0, 104.0, 94.0, 95.0], "value": 98.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [91.0, 94.0, 95.0, 91.0, 96.0, 91.0, 102.0, 94.0, 90.0, 93.0], "value": 93.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 55.0, 56.0, 58.0, 58.0, 60.0, 61.0, 60.0, 60.0, 59.0], "value": 58.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 75.0, 68.0, 82.0, 75.0, 76.0, 67.0, 88.0, 103.0, 93.0], "value": 79.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 85.0, 87.0, 85.0, 84.0, 86.0, 87.0, 94.0, 87.0], "value": 86.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [137.0, 159.0, 130.0, 136.0, 133.0, 156.0, 160.0, 158.0, 186.0, 142.0], "value": 149.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 170.0, 192.0, 171.0, 167.0, 178.0, 170.0, 150.0, 197.0, 152.0], "value": 171.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 65.0, 68.0, 68.0, 69.0, 65.0, 66.0, 66.0, 67.0, 66.0], "value": 66.8, "unit": "score"}]}]} 07:16:47 INFO - Return code: 0 07:16:47 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 07:16:47 ERROR - # TBPL SUCCESS # 07:16:47 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 07:16:47 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 07:16:47 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 07:16:47 INFO - 2016-09-23 07:16:47.450 screenresolution[1954:14236] starting screenresolution argv=screenresolution get 07:16:47 INFO - 2016-09-23 07:16:47.452 screenresolution[1954:14236] Display 0: 1600x1200x32@60 07:16:47 INFO - 2016-09-23 07:16:47.458 screenresolution[1955:14239] starting screenresolution argv=screenresolution list 07:16:47 INFO - Available Modes on Display 0 07:16:47 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 07:16:47 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 07:16:47 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 07:16:47 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 07:16:47 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 07:16:47 INFO - Intel Iris: 07:16:47 INFO - Chipset Model: Intel Iris 07:16:47 INFO - Type: GPU 07:16:47 INFO - Bus: Built-In 07:16:47 INFO - VRAM (Dynamic, Max): 1536 MB 07:16:47 INFO - Vendor: Intel (0x8086) 07:16:47 INFO - Device ID: 0x0a2e 07:16:47 INFO - Revision ID: 0x0009 07:16:47 INFO - Displays: 07:16:47 INFO - Display: 07:16:47 INFO - Resolution: 1600 x 1200 @ 60 Hz 07:16:47 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 07:16:47 INFO - Display Serial Number: 1600x1200 60 07:16:47 INFO - Main Display: Yes 07:16:47 INFO - Mirror: Off 07:16:47 INFO - Online: Yes 07:16:47 INFO - Rotation: Supported 07:16:47 INFO - Return code: 0 07:16:47 INFO - Running post-action listener: _resource_record_post_action 07:16:47 INFO - [mozharness: 2016-09-23 14:16:47.693473Z] Finished run-tests step (success) 07:16:47 INFO - Running post-run listener: _resource_record_post_run 07:16:47 INFO - Total resource usage - Wall time: 1207s; CPU: 54.0%; Read bytes: 991232; Write bytes: 664454144; Read time: 7; Write time: 1818 07:16:47 INFO - TinderboxPrint: CPU usage
54.2% 07:16:47 INFO - TinderboxPrint: I/O read bytes / time
991,232 / 7 07:16:47 INFO - TinderboxPrint: I/O write bytes / time
664,454,144 / 1,818 07:16:47 INFO - TinderboxPrint: CPU idle
2,214.3 (45.8%) 07:16:47 INFO - TinderboxPrint: CPU system
976.5 (20.2%) 07:16:47 INFO - TinderboxPrint: CPU user
1,639.0 (33.9%) 07:16:47 INFO - TinderboxPrint: Swap in / out
363,053,056 / 0 07:16:47 INFO - install - Wall time: 32s; CPU: 54.0%; Read bytes: 359860736; Write bytes: 354625024; Read time: 27371; Write time: 628 07:16:47 INFO - run-tests - Wall time: 1175s; CPU: 54.0%; Read bytes: 155648; Write bytes: 297469952; Read time: 3; Write time: 1114 07:16:48 INFO - Running post-run listener: _upload_blobber_files 07:16:48 INFO - Blob upload gear active. 07:16:48 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:16:48 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 07:16:48 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', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:16:48 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 Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:16:48 INFO - (blobuploader) - INFO - Open directory for files ... 07:16:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:16:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:16:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:16:50 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:16:50 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:16:50 INFO - (blobuploader) - INFO - Done attempting. 07:16:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:16:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:16:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:16:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:16:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:16:51 INFO - (blobuploader) - INFO - Done attempting. 07:16:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 07:16:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:16:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:16:53 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 07:16:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:16:53 INFO - (blobuploader) - INFO - Done attempting. 07:16:53 INFO - (blobuploader) - INFO - Iteration through files over. 07:16:53 INFO - Return code: 0 07:16:53 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:16:53 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:16:53 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/44463511c1047cb4a25b732ca2b4c44e810a24e2e65623b02d441bf7b3c4ca0f90c4d404ac71e5e3da63b3da70f9b396124ae2555cc823aee1031224cde257ea", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ced4ed58025a533602c71cd69b2c02968a1f8342ae404f16a0d3b9ac6b703fdbce90c035c90304d57329d096a656b6a4fe9d11b9a88ae9eca077076736b0a334", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/31e98d4e86d31589d15dce15a92a98206c1c265a5e2906fc9f6bb6631e5793956174b54fc4dfd4aed28484a8d9853cee1433e307a65f084dff670de193dab92d"} 07:16:53 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:16:53 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:16:53 INFO - Contents: 07:16:53 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/44463511c1047cb4a25b732ca2b4c44e810a24e2e65623b02d441bf7b3c4ca0f90c4d404ac71e5e3da63b3da70f9b396124ae2555cc823aee1031224cde257ea", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ced4ed58025a533602c71cd69b2c02968a1f8342ae404f16a0d3b9ac6b703fdbce90c035c90304d57329d096a656b6a4fe9d11b9a88ae9eca077076736b0a334", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/31e98d4e86d31589d15dce15a92a98206c1c265a5e2906fc9f6bb6631e5793956174b54fc4dfd4aed28484a8d9853cee1433e307a65f084dff670de193dab92d"} 07:16:53 INFO - Running post-run listener: copy_logs_to_upload_dir 07:16:53 INFO - Copying logs to upload dir... 07:16:53 INFO - mkdir: /builds/slave/test/build/upload/logs 07:16:53 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1269.769389 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-09-23 07:16:54.048651) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-23 07:16:54.051922) ========= 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: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test/properties RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners TMPDIR=/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/44463511c1047cb4a25b732ca2b4c44e810a24e2e65623b02d441bf7b3c4ca0f90c4d404ac71e5e3da63b3da70f9b396124ae2555cc823aee1031224cde257ea", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ced4ed58025a533602c71cd69b2c02968a1f8342ae404f16a0d3b9ac6b703fdbce90c035c90304d57329d096a656b6a4fe9d11b9a88ae9eca077076736b0a334", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/31e98d4e86d31589d15dce15a92a98206c1c265a5e2906fc9f6bb6631e5793956174b54fc4dfd4aed28484a8d9853cee1433e307a65f084dff670de193dab92d"} build_url:https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011336 build_url: 'https://queue.taskcluster.net/v1/task/I7zXcXvYRIqvANoW7y9qSA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/44463511c1047cb4a25b732ca2b4c44e810a24e2e65623b02d441bf7b3c4ca0f90c4d404ac71e5e3da63b3da70f9b396124ae2555cc823aee1031224cde257ea", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ced4ed58025a533602c71cd69b2c02968a1f8342ae404f16a0d3b9ac6b703fdbce90c035c90304d57329d096a656b6a4fe9d11b9a88ae9eca077076736b0a334", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/31e98d4e86d31589d15dce15a92a98206c1c265a5e2906fc9f6bb6631e5793956174b54fc4dfd4aed28484a8d9853cee1433e307a65f084dff670de193dab92d"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-23 07:16:54.085350) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-23 07:16:54.085702) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.z3YI2Hxs8x/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.j7UZafg5O6/Listeners TMPDIR=/var/folders/rg/gwlnpvp52557f_83wf586mv000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005133 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-23 07:16:54.134313) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-23 07:16:54.134662) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-23 07:16:54.134968) ========= ========= Total master_lag: 0.26 =========