builder: mozilla-aurora_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0005 starttime: 1477754906.37 results: success (0) buildid: 20161029063801 builduid: ff571670d5d24a45b3c8d97bcf0653ea revision: c683b0d41a52ffab980165b79b9c82590001354b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:26.365838) ========= master: http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:26.366490) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:26.366931) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:26.394065) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:26.394756) ========= 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.5gjUHbH12J/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.3J5rpcHLlB/Listeners TMPDIR=/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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-10-29 08:28:26-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 15.4M=0.001s 2016-10-29 08:28:26 (15.4 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.142777 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:26.564916) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:26.565434) ========= 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.5gjUHbH12J/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.3J5rpcHLlB/Listeners TMPDIR=/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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.030079 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:26.615365) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 4 secs) (at 2016-10-29 08:28:26.615674) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev c683b0d41a52ffab980165b79b9c82590001354b --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 c683b0d41a52ffab980165b79b9c82590001354b --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.5gjUHbH12J/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.3J5rpcHLlB/Listeners TMPDIR=/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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-10-29 08:28:26,679 truncating revision to first 12 chars 2016-10-29 08:28:26,679 Setting DEBUG logging. 2016-10-29 08:28:26,679 attempt 1/10 2016-10-29 08:28:26,679 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/c683b0d41a52?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-29 08:28:27,693 unpacking tar archive at: mozilla-aurora-c683b0d41a52/testing/mozharness/ program finished with exit code 0 elapsedTime=1.278005 ========= master_lag: 2.94 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 4 secs) (at 2016-10-29 08:28:30.831379) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:30.831703) ========= script_repo_revision: c683b0d41a52ffab980165b79b9c82590001354b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:30.832104) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:30.832370) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-29 08:28:30.852092) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 11 secs) (at 2016-10-29 08:28:30.852414) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --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', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--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.5gjUHbH12J/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.3J5rpcHLlB/Listeners TMPDIR=/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:28:31 INFO - MultiFileLogger online at 20161029 08:28:31 in /builds/slave/test 08:28:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 08:28:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:28:31 INFO - {'append_to_log': False, 08:28:31 INFO - 'base_work_dir': '/builds/slave/test', 08:28:31 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:28:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:28:31 INFO - 'branch': 'Mozilla-Aurora', 08:28:31 INFO - 'buildbot_json_path': 'buildprops.json', 08:28:31 INFO - 'config_files': ('talos/mac_config.py',), 08:28:31 INFO - 'default_actions': ('clobber', 08:28:31 INFO - 'read-buildbot-config', 08:28:31 INFO - 'download-and-extract', 08:28:31 INFO - 'populate-webroot', 08:28:31 INFO - 'create-virtualenv', 08:28:31 INFO - 'install', 08:28:31 INFO - 'run-tests'), 08:28:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:28:31 INFO - 'download_minidump_stackwalk': True, 08:28:31 INFO - 'download_symbols': 'ondemand', 08:28:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:28:31 INFO - 'tooltool.py': '/tools/tooltool.py', 08:28:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:28:31 INFO - '/tools/misc-python/virtualenv.py')}, 08:28:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:28:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:28:31 INFO - 'installer_path': 'installer.exe', 08:28:31 INFO - 'log_level': 'info', 08:28:31 INFO - 'log_name': 'talos', 08:28:31 INFO - 'log_to_console': True, 08:28:31 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 08:28:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 08:28:31 INFO - 'opt_config_files': (), 08:28:31 INFO - 'pip_index': False, 08:28:31 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:28:31 INFO - 'cmd': ('bash', 08:28:31 INFO - '-c', 08:28:31 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:28:31 INFO - 'enabled': True, 08:28:31 INFO - 'halt_on_failure': False, 08:28:31 INFO - 'name': 'check_screen_resolution'},), 08:28:31 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:28:31 INFO - 'cmd': ('bash', 08:28:31 INFO - '-c', 08:28:31 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:28:31 INFO - 'enabled': True, 08:28:31 INFO - 'halt_on_failure': False, 08:28:31 INFO - 'name': 'check_screen_resolution'},), 08:28:31 INFO - 'run_cmd_checks_enabled': True, 08:28:31 INFO - 'sps_profile': False, 08:28:31 INFO - 'sps_profile_interval': 0, 08:28:31 INFO - 'suite': 'dromaeojs', 08:28:31 INFO - 'system_bits': '32', 08:28:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:28:31 INFO - 'title': 't-yosemite-r7-0005', 08:28:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:28:31 INFO - 'use_talos_json': True, 08:28:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:28:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:28:31 INFO - 'work_dir': 'build'} 08:28:31 INFO - [mozharness: 2016-10-29 15:28:31.041475Z] Running clobber step. 08:28:31 INFO - Running pre-action listener: _resource_record_pre_action 08:28:31 INFO - Running main action method: clobber 08:28:31 INFO - rmtree: /builds/slave/test/build 08:28:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:28:33 INFO - Running post-action listener: _resource_record_post_action 08:28:33 INFO - [mozharness: 2016-10-29 15:28:33.314078Z] Finished clobber step (success) 08:28:33 INFO - [mozharness: 2016-10-29 15:28:33.314194Z] Running read-buildbot-config step. 08:28:33 INFO - Running pre-action listener: _resource_record_pre_action 08:28:33 INFO - Running main action method: read_buildbot_config 08:28:33 INFO - Using buildbot properties: 08:28:33 INFO - { 08:28:33 INFO - "project": "", 08:28:33 INFO - "product": "firefox", 08:28:33 INFO - "script_repo_revision": "production", 08:28:33 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs", 08:28:33 INFO - "repository": "", 08:28:33 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs", 08:28:33 INFO - "buildid": "20161029063801", 08:28:33 INFO - "pgo_build": "False", 08:28:33 INFO - "basedir": "/builds/slave/test", 08:28:33 INFO - "buildnumber": 7, 08:28:33 INFO - "slavename": "t-yosemite-r7-0005", 08:28:33 INFO - "master": "http://buildbot-master136.bb.releng.scl3.mozilla.com:8201/", 08:28:33 INFO - "platform": "yosemite_r7", 08:28:33 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 08:28:33 INFO - "branch": "mozilla-aurora", 08:28:33 INFO - "repo_path": "releases/mozilla-aurora", 08:28:33 INFO - "revision": "c683b0d41a52ffab980165b79b9c82590001354b", 08:28:33 INFO - "stage_platform": "macosx64", 08:28:33 INFO - "builduid": "ff571670d5d24a45b3c8d97bcf0653ea", 08:28:33 INFO - "slavebuilddir": "test" 08:28:33 INFO - } 08:28:33 INFO - Found installer url https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg. 08:28:33 INFO - Running post-action listener: _resource_record_post_action 08:28:33 INFO - [mozharness: 2016-10-29 15:28:33.317338Z] Finished read-buildbot-config step (success) 08:28:33 INFO - [mozharness: 2016-10-29 15:28:33.317476Z] Running download-and-extract step. 08:28:33 INFO - Running pre-action listener: _resource_record_pre_action 08:28:33 INFO - Running main action method: download_and_extract 08:28:33 INFO - mkdir: /builds/slave/test/build/tests 08:28:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:28:33 INFO - trying https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json 08:28:33 INFO - Downloading https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/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 08:28:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/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 08:28:34 INFO - Downloaded 1199 bytes. 08:28:34 INFO - Reading from file /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 08:28:34 INFO - Using the following test package requirements: 08:28:34 INFO - {u'common': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 08:28:34 INFO - u'cppunittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:28:34 INFO - u'firefox-51.0a2.en-US.mac.cppunittest.tests.zip'], 08:28:34 INFO - u'gtest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:28:34 INFO - u'firefox-51.0a2.en-US.mac.gtest.tests.zip'], 08:28:34 INFO - u'jittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:28:34 INFO - u'jsshell-mac.zip'], 08:28:34 INFO - u'mochitest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:28:34 INFO - u'firefox-51.0a2.en-US.mac.mochitest.tests.zip'], 08:28:34 INFO - u'mozbase': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 08:28:34 INFO - u'reftest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:28:34 INFO - u'firefox-51.0a2.en-US.mac.reftest.tests.zip'], 08:28:34 INFO - u'talos': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:28:34 INFO - u'firefox-51.0a2.en-US.mac.talos.tests.zip'], 08:28:34 INFO - u'web-platform': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:28:34 INFO - u'firefox-51.0a2.en-US.mac.web-platform.tests.zip'], 08:28:34 INFO - u'xpcshell': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:28:34 INFO - u'firefox-51.0a2.en-US.mac.xpcshell.tests.zip']} 08:28:34 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip'] for test suite category: common 08:28:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 08:28:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 08:28:34 INFO - Fetch https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 08:28:34 INFO - Expected file size: 16421453 08:28:42 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 08:28:42 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 08:28:42 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 08:28:42 INFO - Fetch https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 08:28:42 INFO - Expected file size: 16421453 08:28:49 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip 08:28:49 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip'}, attempt #1 08:28:49 INFO - Fetch https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip into memory 08:28:50 INFO - Expected file size: 14414089 08:28:50 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')]} 08:28:50 INFO - trying https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 08:28:50 INFO - Downloading https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg 08:28:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/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 08:28:53 INFO - Downloaded 115419558 bytes. 08:28:53 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 08:28:53 INFO - mkdir: /builds/slave/test/properties 08:28:53 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:28:53 INFO - Writing to file /builds/slave/test/properties/build_url 08:28:53 INFO - Contents: 08:28:53 INFO - build_url:https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 08:28:54 INFO - Running post-action listener: _resource_record_post_action 08:28:54 INFO - Running post-action listener: set_extra_try_arguments 08:28:54 INFO - [mozharness: 2016-10-29 15:28:54.658549Z] Finished download-and-extract step (success) 08:28:54 INFO - [mozharness: 2016-10-29 15:28:54.658677Z] Running populate-webroot step. 08:28:54 INFO - Running pre-action listener: _resource_record_pre_action 08:28:54 INFO - Running main action method: populate_webroot 08:28:54 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:28:54 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:28:54 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:28:54 INFO - '--tppagecycles', 08:28:54 INFO - '7'], 08:28:54 INFO - 'tests': ['tsvgm']}}, 08:28:54 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:28:54 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:28:54 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:28:54 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:28:54 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:54 INFO - 'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:28:54 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:28:54 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:54 INFO - 'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['damp', 'tps']}, 08:28:54 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:54 INFO - 'tests': ['damp', 'tps']}, 08:28:54 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['dromaeo_dom']}, 08:28:54 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:28:54 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['basic_compositor_video']}, 08:28:54 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:28:54 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['a11yr', 08:28:54 INFO - 'ts_paint', 08:28:54 INFO - 'tpaint', 08:28:54 INFO - 'sessionrestore', 08:28:54 INFO - 'sessionrestore_no_auto_restore', 08:28:54 INFO - 'tabpaint']}, 08:28:54 INFO - 'other-e10s': {'tests': ['a11yr', 08:28:54 INFO - 'ts_paint', 08:28:54 INFO - 'tpaint', 08:28:54 INFO - 'sessionrestore', 08:28:54 INFO - 'sessionrestore_no_auto_restore', 08:28:54 INFO - 'tabpaint']}, 08:28:54 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:28:54 INFO - 'ts_paint', 08:28:54 INFO - 'tpaint', 08:28:54 INFO - 'sessionrestore', 08:28:54 INFO - 'sessionrestore_no_auto_restore', 08:28:54 INFO - 'tabpaint']}, 08:28:54 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:28:54 INFO - 'ts_paint', 08:28:54 INFO - 'tpaint', 08:28:54 INFO - 'sessionrestore', 08:28:54 INFO - 'sessionrestore_no_auto_restore', 08:28:54 INFO - 'tabpaint']}, 08:28:54 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['a11yr', 08:28:54 INFO - 'ts_paint', 08:28:54 INFO - 'tpaint', 08:28:54 INFO - 'sessionrestore', 08:28:54 INFO - 'sessionrestore_no_auto_restore', 08:28:54 INFO - 'tabpaint']}, 08:28:54 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['a11yr', 08:28:54 INFO - 'ts_paint', 08:28:54 INFO - 'tpaint', 08:28:54 INFO - 'sessionrestore', 08:28:54 INFO - 'sessionrestore_no_auto_restore', 08:28:54 INFO - 'tabpaint']}, 08:28:54 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['tsvgx', 08:28:54 INFO - 'tsvgr_opacity', 08:28:54 INFO - 'tart', 08:28:54 INFO - 'tscrollx', 08:28:54 INFO - 'cart']}, 08:28:54 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:28:54 INFO - 'tsvgr_opacity', 08:28:54 INFO - 'tart', 08:28:54 INFO - 'tscrollx', 08:28:54 INFO - 'cart']}, 08:28:54 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:54 INFO - 'talos_options': ['--disable-e10s'], 08:28:54 INFO - 'tests': ['tp5o']}, 08:28:54 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:54 INFO - 'tests': ['tp5o']}, 08:28:54 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:54 INFO - 'talos_options': ['--disable-e10s', 08:28:54 INFO - '--xperf_path', 08:28:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:28:54 INFO - 'tests': ['tp5n']}, 08:28:54 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:54 INFO - 'talos_options': ['--xperf_path', 08:28:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:28:54 INFO - 'tests': ['tp5n']}}, 08:28:54 INFO - 'talos.zip': {'path': '', 08:28:54 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:28:54 INFO - Running post-action listener: _resource_record_post_action 08:28:54 INFO - [mozharness: 2016-10-29 15:28:54.677725Z] Finished populate-webroot step (success) 08:28:54 INFO - [mozharness: 2016-10-29 15:28:54.677866Z] Running create-virtualenv step. 08:28:54 INFO - Running pre-action listener: _resource_record_pre_action 08:28:54 INFO - Running main action method: create_virtualenv 08:28:54 INFO - Creating virtualenv /builds/slave/test/build/venv 08:28:54 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 08:28:54 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:28:54 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:28:54 INFO - Using real prefix '/tools/python27' 08:28:54 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:28:55 INFO - Installing distribute.............................................................................................................................................................................................done. 08:28:58 INFO - Installing pip.................done. 08:28:58 INFO - Return code: 0 08:28:58 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:28:58 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')]} 08:28:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:28:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:28:58 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')]} 08:28:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:28:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:28:58 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:28:58 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 08:28:58 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 08:28:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:28:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:28:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:28:58 INFO - 'HOME': '/Users/cltbld', 08:28:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:28:58 INFO - 'LOGNAME': 'cltbld', 08:28:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:28:58 INFO - 'MOZ_NO_REMOTE': '1', 08:28:58 INFO - 'NO_EM_RESTART': '1', 08:28:58 INFO - 'PAGER': '/bin/cat', 08:28:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:28:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:28:58 INFO - 'PWD': '/builds/slave/test', 08:28:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:28:58 INFO - 'SHELL': '/bin/bash', 08:28:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:28:58 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:28:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:28:58 INFO - 'USER': 'cltbld', 08:28:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:28:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:28:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:28:58 INFO - 'XPC_FLAGS': '0x0', 08:28:58 INFO - 'XPC_SERVICE_NAME': '0', 08:28:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:28:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:28:58 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 08:28:58 INFO - Cleaning up... 08:28:58 INFO - Return code: 0 08:28:58 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:28:58 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')]} 08:28:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:28:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:28:58 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')]} 08:28:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:28:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:28:58 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:28:58 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 08:28:58 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 08:28:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:28:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:28:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:28:58 INFO - 'HOME': '/Users/cltbld', 08:28:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:28:58 INFO - 'LOGNAME': 'cltbld', 08:28:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:28:58 INFO - 'MOZ_NO_REMOTE': '1', 08:28:58 INFO - 'NO_EM_RESTART': '1', 08:28:58 INFO - 'PAGER': '/bin/cat', 08:28:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:28:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:28:58 INFO - 'PWD': '/builds/slave/test', 08:28:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:28:58 INFO - 'SHELL': '/bin/bash', 08:28:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:28:58 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:28:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:28:58 INFO - 'USER': 'cltbld', 08:28:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:28:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:28:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:28:58 INFO - 'XPC_FLAGS': '0x0', 08:28:58 INFO - 'XPC_SERVICE_NAME': '0', 08:28:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:28:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:28:58 INFO - Downloading/unpacking psutil>=3.1.1 08:28:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:28:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:28:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:28:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:28:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:28:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:29:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:29:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:29:02 INFO - Installing collected packages: psutil 08:29:02 INFO - Running setup.py install for psutil 08:29:02 INFO - building 'psutil._psutil_osx' extension 08:29:02 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 08:29:02 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 08:29:02 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 08:29:02 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 08:29:02 INFO - building 'psutil._psutil_posix' extension 08:29:02 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 08:29:03 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 08:29:03 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 08:29:03 INFO - ^ 08:29:03 INFO - 1 warning generated. 08:29:03 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 08:29:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:29:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:29:03 INFO - Successfully installed psutil 08:29:03 INFO - Cleaning up... 08:29:03 INFO - Return code: 0 08:29:03 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:29:03 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')]} 08:29:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:03 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')]} 08:29:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:03 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:29:03 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 08:29:03 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 08:29:03 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:03 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:03 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:03 INFO - 'HOME': '/Users/cltbld', 08:29:03 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:03 INFO - 'LOGNAME': 'cltbld', 08:29:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:03 INFO - 'MOZ_NO_REMOTE': '1', 08:29:03 INFO - 'NO_EM_RESTART': '1', 08:29:03 INFO - 'PAGER': '/bin/cat', 08:29:03 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:03 INFO - 'PWD': '/builds/slave/test', 08:29:03 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:03 INFO - 'SHELL': '/bin/bash', 08:29:03 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:03 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:03 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:03 INFO - 'USER': 'cltbld', 08:29:03 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:03 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:03 INFO - 'XPC_FLAGS': '0x0', 08:29:03 INFO - 'XPC_SERVICE_NAME': '0', 08:29:03 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:03 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:29:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:29:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:29:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:29:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:29:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:06 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:29:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:29:06 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:29:06 INFO - Installing collected packages: mozsystemmonitor 08:29:06 INFO - Running setup.py install for mozsystemmonitor 08:29:06 INFO - Successfully installed mozsystemmonitor 08:29:06 INFO - Cleaning up... 08:29:06 INFO - Return code: 0 08:29:06 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:29:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:06 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:29:06 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 08:29:06 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 08:29:06 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:06 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:06 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:06 INFO - 'HOME': '/Users/cltbld', 08:29:06 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:06 INFO - 'LOGNAME': 'cltbld', 08:29:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:06 INFO - 'MOZ_NO_REMOTE': '1', 08:29:06 INFO - 'NO_EM_RESTART': '1', 08:29:06 INFO - 'PAGER': '/bin/cat', 08:29:06 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:06 INFO - 'PWD': '/builds/slave/test', 08:29:06 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:06 INFO - 'SHELL': '/bin/bash', 08:29:06 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:06 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:06 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:06 INFO - 'USER': 'cltbld', 08:29:06 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:06 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:06 INFO - 'XPC_FLAGS': '0x0', 08:29:06 INFO - 'XPC_SERVICE_NAME': '0', 08:29:06 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:06 INFO - Downloading/unpacking jsonschema==2.5.1 08:29:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:29:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:29:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:29:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:29:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:29:09 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:29:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:29:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:29:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:29:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:29:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:09 INFO - Downloading functools32-3.2.3-2.tar.gz 08:29:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:29:09 INFO - warning: no files found matching '*.txt' 08:29:09 INFO - no previously-included directories found matching 'build' 08:29:09 INFO - no previously-included directories found matching 'dist' 08:29:09 INFO - no previously-included directories found matching '.git*' 08:29:09 INFO - Installing collected packages: jsonschema, functools32 08:29:09 INFO - Running setup.py install for functools32 08:29:09 INFO - warning: no files found matching '*.txt' 08:29:09 INFO - no previously-included directories found matching 'build' 08:29:09 INFO - no previously-included directories found matching 'dist' 08:29:09 INFO - no previously-included directories found matching '.git*' 08:29:09 INFO - Successfully installed jsonschema functools32 08:29:09 INFO - Cleaning up... 08:29:10 INFO - Return code: 0 08:29:10 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:29:10 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')]} 08:29:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:10 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')]} 08:29:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:10 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:29:10 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 08:29:10 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 08:29:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:10 INFO - 'HOME': '/Users/cltbld', 08:29:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:10 INFO - 'LOGNAME': 'cltbld', 08:29:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:10 INFO - 'MOZ_NO_REMOTE': '1', 08:29:10 INFO - 'NO_EM_RESTART': '1', 08:29:10 INFO - 'PAGER': '/bin/cat', 08:29:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:10 INFO - 'PWD': '/builds/slave/test', 08:29:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:10 INFO - 'SHELL': '/bin/bash', 08:29:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:10 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:10 INFO - 'USER': 'cltbld', 08:29:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:10 INFO - 'XPC_FLAGS': '0x0', 08:29:10 INFO - 'XPC_SERVICE_NAME': '0', 08:29:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:10 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:29:10 INFO - Cleaning up... 08:29:10 INFO - Return code: 0 08:29:10 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:29:10 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')]} 08:29:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:10 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')]} 08:29:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:10 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:29:10 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 08:29:10 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 08:29:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:10 INFO - 'HOME': '/Users/cltbld', 08:29:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:10 INFO - 'LOGNAME': 'cltbld', 08:29:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:10 INFO - 'MOZ_NO_REMOTE': '1', 08:29:10 INFO - 'NO_EM_RESTART': '1', 08:29:10 INFO - 'PAGER': '/bin/cat', 08:29:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:10 INFO - 'PWD': '/builds/slave/test', 08:29:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:10 INFO - 'SHELL': '/bin/bash', 08:29:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:10 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:10 INFO - 'USER': 'cltbld', 08:29:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:10 INFO - 'XPC_FLAGS': '0x0', 08:29:10 INFO - 'XPC_SERVICE_NAME': '0', 08:29:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:10 INFO - Downloading/unpacking blobuploader==1.2.4 08:29:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:29:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:29:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:29:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:29:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:29:13 INFO - Downloading blobuploader-1.2.4.tar.gz 08:29:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:29:13 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:29: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 08:29: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 08:29: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 08:29: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 08:29: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 08:29: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 08:29:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:29:13 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:29: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 08:29: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 08:29: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 08:29: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 08:29: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 08:29: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 08:29:14 INFO - Downloading docopt-0.6.1.tar.gz 08:29:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:29:14 INFO - Installing collected packages: blobuploader, requests, docopt 08:29:14 INFO - Running setup.py install for blobuploader 08:29:14 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:29:14 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:29:14 INFO - Running setup.py install for requests 08:29:15 INFO - Running setup.py install for docopt 08:29:15 INFO - Successfully installed blobuploader requests docopt 08:29:15 INFO - Cleaning up... 08:29:15 INFO - Return code: 0 08:29:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:29:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:15 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:29:15 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 08:29:15 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 08:29:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:15 INFO - 'HOME': '/Users/cltbld', 08:29:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:15 INFO - 'LOGNAME': 'cltbld', 08:29:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:15 INFO - 'MOZ_NO_REMOTE': '1', 08:29:15 INFO - 'NO_EM_RESTART': '1', 08:29:15 INFO - 'PAGER': '/bin/cat', 08:29:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:15 INFO - 'PWD': '/builds/slave/test', 08:29:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:15 INFO - 'SHELL': '/bin/bash', 08:29:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:15 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:15 INFO - 'USER': 'cltbld', 08:29:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:15 INFO - 'XPC_FLAGS': '0x0', 08:29:15 INFO - 'XPC_SERVICE_NAME': '0', 08:29:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:29:15 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-1yv6yG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:29:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:29:15 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-PlEp5h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:29:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:29:15 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-UiYmWj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:29:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:29:15 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-icsn6L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:29:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:29:15 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-A2IexE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-YWDtLB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-xhRWRn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-8RtJvm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-faXJ0I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-XZo9IU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-bC7M7u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-OvU_Vm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-S74KzY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-x3xHHS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:29:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:29:16 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-ezCrwi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:29:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:29:17 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-EUWj74-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:29:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:29:17 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-RjrjMc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:29:17 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:29:17 INFO - Running setup.py install for manifestparser 08:29:17 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:29:17 INFO - Running setup.py install for mozcrash 08:29:17 INFO - Running setup.py install for mozdebug 08:29:17 INFO - Running setup.py install for mozdevice 08:29:17 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:29:17 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:29:17 INFO - Running setup.py install for mozfile 08:29:18 INFO - Running setup.py install for mozhttpd 08:29:18 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:29:18 INFO - Running setup.py install for mozinfo 08:29:18 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:29:18 INFO - Running setup.py install for mozInstall 08:29:18 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:29:18 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:29:18 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:29:18 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:29:18 INFO - Running setup.py install for mozleak 08:29:18 INFO - Running setup.py install for mozlog 08:29:18 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:29:18 INFO - Running setup.py install for moznetwork 08:29:18 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:29:18 INFO - Running setup.py install for mozprocess 08:29:19 INFO - Running setup.py install for mozprofile 08:29:19 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:29:19 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:29:19 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:29:19 INFO - Running setup.py install for mozrunner 08:29:19 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:29:19 INFO - Running setup.py install for mozscreenshot 08:29:19 INFO - Running setup.py install for moztest 08:29:19 INFO - Running setup.py install for mozversion 08:29:19 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:29:19 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:29:19 INFO - Cleaning up... 08:29:19 INFO - Return code: 0 08:29:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:29:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:19 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:29:19 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 08:29:19 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 08:29:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:19 INFO - 'HOME': '/Users/cltbld', 08:29:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:19 INFO - 'LOGNAME': 'cltbld', 08:29:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:19 INFO - 'MOZ_NO_REMOTE': '1', 08:29:19 INFO - 'NO_EM_RESTART': '1', 08:29:19 INFO - 'PAGER': '/bin/cat', 08:29:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:19 INFO - 'PWD': '/builds/slave/test', 08:29:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:19 INFO - 'SHELL': '/bin/bash', 08:29:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:19 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:19 INFO - 'USER': 'cltbld', 08:29:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:19 INFO - 'XPC_FLAGS': '0x0', 08:29:19 INFO - 'XPC_SERVICE_NAME': '0', 08:29:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-TeMf__-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:29:20 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)) 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-8Nl_jm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:29:20 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)) 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-hewb4E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:29:20 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)) 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-UnQf1H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:29:20 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)) 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-UCW51I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:29:20 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)) 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-O2sMb_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:29:20 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)) 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-Qdg5FF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:29:20 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)) 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-qfiSIc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:29:20 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)) 08:29:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:29:20 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-2x1CQQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:29:21 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)) 08:29:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:29:21 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-ZcAGgj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:29:21 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)) 08:29:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:29:21 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-Xp2kxE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:29:21 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)) 08:29:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:29:21 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-bSQtuV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:29:21 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)) 08:29:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:29:21 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-4YouvN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:29:21 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)) 08:29:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:29:21 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-V6vmOd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:29:21 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)) 08:29:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:29:21 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-VPRHMG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:29:21 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)) 08:29:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:29:21 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-YnfJAi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:29:21 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)) 08:29:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:29:21 INFO - Running setup.py (path:/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/pip-PwYacK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:29:21 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)) 08:29:21 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)) 08:29:21 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)) 08:29:21 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)) 08:29:21 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)) 08:29:21 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)) 08:29:21 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:29: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 08:29: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 08:29: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 08:29: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 08:29: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 08:29: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 08:29:24 INFO - Downloading blessings-1.6.tar.gz 08:29:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:29:24 INFO - Installing collected packages: blessings 08:29:24 INFO - Running setup.py install for blessings 08:29:24 INFO - Successfully installed blessings 08:29:24 INFO - Cleaning up... 08:29:24 INFO - Return code: 0 08:29:24 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:29:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:29:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:29:25 INFO - Reading from file tmpfile_stdout 08:29:25 INFO - Current package versions: 08:29:25 INFO - blessings == 1.6 08:29:25 INFO - blobuploader == 1.2.4 08:29:25 INFO - docopt == 0.6.1 08:29:25 INFO - functools32 == 3.2.3-2 08:29:25 INFO - jsonschema == 2.5.1 08:29:25 INFO - manifestparser == 1.1 08:29:25 INFO - mozInstall == 1.12 08:29:25 INFO - mozcrash == 0.17 08:29:25 INFO - mozdebug == 0.1 08:29:25 INFO - mozdevice == 0.48 08:29:25 INFO - mozfile == 1.2 08:29:25 INFO - mozhttpd == 0.7 08:29:25 INFO - mozinfo == 0.9 08:29:25 INFO - mozleak == 0.1 08:29:25 INFO - mozlog == 3.4 08:29:25 INFO - moznetwork == 0.27 08:29:25 INFO - mozprocess == 0.23 08:29:25 INFO - mozprofile == 0.28 08:29:25 INFO - mozrunner == 6.12 08:29:25 INFO - mozscreenshot == 0.1 08:29:25 INFO - mozsystemmonitor == 0.3 08:29:25 INFO - moztest == 0.7 08:29:25 INFO - mozversion == 1.4 08:29:25 INFO - psutil == 3.1.1 08:29:25 INFO - requests == 1.2.3 08:29:25 INFO - wsgiref == 0.1.2 08:29:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:29:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:25 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 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:29:25 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 08:29:25 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 08:29:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:25 INFO - 'HOME': '/Users/cltbld', 08:29:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:25 INFO - 'LOGNAME': 'cltbld', 08:29:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:25 INFO - 'MOZ_NO_REMOTE': '1', 08:29:25 INFO - 'NO_EM_RESTART': '1', 08:29:25 INFO - 'PAGER': '/bin/cat', 08:29:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:25 INFO - 'PWD': '/builds/slave/test', 08:29:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:25 INFO - 'SHELL': '/bin/bash', 08:29:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:25 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:25 INFO - 'USER': 'cltbld', 08:29:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:25 INFO - 'XPC_FLAGS': '0x0', 08:29:25 INFO - 'XPC_SERVICE_NAME': '0', 08:29:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 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)) 08:29:25 INFO - Cleaning up... 08:29:25 INFO - Return code: 0 08:29:25 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:29:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:29:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1c2490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e138570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc403cc7590>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, '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.5gjUHbH12J/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.3J5rpcHLlB/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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 08:29:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 08:29:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 08:29:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:25 INFO - 'HOME': '/Users/cltbld', 08:29:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:25 INFO - 'LOGNAME': 'cltbld', 08:29:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:25 INFO - 'MOZ_NO_REMOTE': '1', 08:29:25 INFO - 'NO_EM_RESTART': '1', 08:29:25 INFO - 'PAGER': '/bin/cat', 08:29:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:25 INFO - 'PWD': '/builds/slave/test', 08:29:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:25 INFO - 'SHELL': '/bin/bash', 08:29:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:25 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:25 INFO - 'USER': 'cltbld', 08:29:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:25 INFO - 'XPC_FLAGS': '0x0', 08:29:25 INFO - 'XPC_SERVICE_NAME': '0', 08:29:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:25 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:29:25 INFO - Cleaning up... 08:29:26 INFO - Return code: 0 08:29:26 INFO - Running post-action listener: _resource_record_post_action 08:29:26 INFO - Running post-action listener: _start_resource_monitoring 08:29:26 INFO - Starting resource monitoring. 08:29:26 INFO - [mozharness: 2016-10-29 15:29:26.028224Z] Finished create-virtualenv step (success) 08:29:26 INFO - [mozharness: 2016-10-29 15:29:26.029190Z] Running install step. 08:29:26 INFO - Running pre-action listener: _resource_record_pre_action 08:29:26 INFO - Running main action method: install 08:29:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:29:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:29:26 INFO - Reading from file tmpfile_stdout 08:29:26 INFO - Detecting whether we're running mozinstall >=1.0... 08:29:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:29:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:29:26 INFO - Reading from file tmpfile_stdout 08:29:26 INFO - Output received: 08:29:26 INFO - Usage: mozinstall [options] installer 08:29:26 INFO - Options: 08:29:26 INFO - -h, --help show this help message and exit 08:29:26 INFO - -d DEST, --destination=DEST 08:29:26 INFO - Directory to install application into. [default: 08:29:26 INFO - "/builds/slave/test"] 08:29:26 INFO - --app=APP Application being installed. [default: firefox] 08:29:26 INFO - mkdir: /builds/slave/test/build/application 08:29:26 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'] 08:29:26 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 08:29:58 INFO - Reading from file tmpfile_stdout 08:29:58 INFO - Output received: 08:29:58 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 08:29:58 INFO - Running post-action listener: _resource_record_post_action 08:29:58 INFO - [mozharness: 2016-10-29 15:29:58.862824Z] Finished install step (success) 08:29:58 INFO - [mozharness: 2016-10-29 15:29:58.862943Z] Running run-tests step. 08:29:58 INFO - Running pre-action listener: _resource_record_pre_action 08:29:58 INFO - Running main action method: run_tests 08:29:58 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:29:58 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:29:58 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:29:58 INFO - 2016-10-29 08:29:58.877 screenresolution[1641:7544] starting screenresolution argv=screenresolution get 08:29:58 INFO - 2016-10-29 08:29:58.880 screenresolution[1641:7544] Display 0: 1600x1200x32@60 08:29:58 INFO - 2016-10-29 08:29:58.885 screenresolution[1642:7546] starting screenresolution argv=screenresolution list 08:29:58 INFO - Available Modes on Display 0 08:29:58 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:29:58 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:29:58 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:29:58 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:29:59 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:29:59 INFO - Intel Iris: 08:29:59 INFO - Chipset Model: Intel Iris 08:29:59 INFO - Type: GPU 08:29:59 INFO - Bus: Built-In 08:29:59 INFO - VRAM (Dynamic, Max): 1536 MB 08:29:59 INFO - Vendor: Intel (0x8086) 08:29:59 INFO - Device ID: 0x0a2e 08:29:59 INFO - Revision ID: 0x0009 08:29:59 INFO - Displays: 08:29:59 INFO - Display: 08:29:59 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:29:59 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:29:59 INFO - Display Serial Number: 1600x1200 60 08:29:59 INFO - Main Display: Yes 08:29:59 INFO - Mirror: Off 08:29:59 INFO - Online: Yes 08:29:59 INFO - Rotation: Supported 08:29:59 INFO - Return code: 0 08:29:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:29:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:29:59 INFO - Python 2.7.3 08:29:59 INFO - Return code: 0 08:29:59 INFO - grabbing minidump binary from tooltool 08:29:59 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')]} 08:29:59 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 0x10dfd6d30>, '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 0x10de3cdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10dfceb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:29:59 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 08:29:59 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 08:29:59 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 08:29:59 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:29:59 INFO - Return code: 0 08:29:59 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 08:29:59 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:29:59 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:29:59 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 08:29:59 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:29:59 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', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0005', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 08:29:59 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 --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0005 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 08:29:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.5gjUHbH12J/Render', 08:29:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:29:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:29:59 INFO - 'HOME': '/Users/cltbld', 08:29:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:29:59 INFO - 'LOGNAME': 'cltbld', 08:29:59 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:29:59 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 08:29:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:59 INFO - 'MOZ_NO_REMOTE': '1', 08:29:59 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:29:59 INFO - 'NO_EM_RESTART': '1', 08:29:59 INFO - 'PAGER': '/bin/cat', 08:29:59 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:29:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:59 INFO - 'PWD': '/builds/slave/test', 08:29:59 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:29:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:29:59 INFO - 'SHELL': '/bin/bash', 08:29:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.3J5rpcHLlB/Listeners', 08:29:59 INFO - 'TMPDIR': '/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/', 08:29:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:29:59 INFO - 'USER': 'cltbld', 08:29:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:29:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:29:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:59 INFO - 'XPC_FLAGS': '0x0', 08:29:59 INFO - 'XPC_SERVICE_NAME': '0', 08:29:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:29:59 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0005', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 08:29:59 INFO - mozversion application_buildid: 20161029063801 08:29:59 INFO - mozversion application_changeset: c683b0d41a52ffab980165b79b9c82590001354b 08:29:59 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:29:59 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:29:59 INFO - mozversion application_name: Firefox 08:29:59 INFO - mozversion application_remotingname: firefox-dev 08:29:59 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:29:59 INFO - mozversion application_vendor: Mozilla 08:29:59 INFO - mozversion application_version: 51.0a2 08:29:59 INFO - mozversion platform_buildid: 20161029063801 08:29:59 INFO - mozversion platform_changeset: c683b0d41a52ffab980165b79b9c82590001354b 08:29:59 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:29:59 INFO - mozversion platform_version: 51.0a2 08:29:59 INFO - using testdate: 1477754999 08:29:59 INFO - actual date: 1477754999 08:29:59 INFO - starting webserver on 'localhost:49274' 08:29:59 INFO - SUITE-START | Running 2 tests 08:29:59 INFO - TEST-START | dromaeo_css 08:29:59 INFO - operating with platform_type : mac_ 08:29:59 INFO - Initialising browser for dromaeo_css test... 08:29:59 INFO - TEST-INFO | started process 1652 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/tmpkGCgCE/profile http://localhost:49274/getInfo.html) 08:30:02 INFO - PROCESS | 1652 | __metrics Screen width/height:1600/1200 08:30:02 INFO - PROCESS | 1652 | colorDepth:24 08:30:02 INFO - PROCESS | 1652 | Browser inner width/height: 1024/689 08:30:02 INFO - PROCESS | 1652 | __metrics 08:30:02 INFO - PROCESS | 1652 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:30:02 INFO - PROCESS | 1652 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:30:02 INFO - TEST-INFO | 1652: exit 0 08:30:02 INFO - Browser initialized. 08:30:02 INFO - Running cycle 1/1 for dromaeo_css test... 08:30:02 INFO - TEST-INFO | started process 1655 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/tmpkGCgCE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:30:15 INFO - PROCESS | 1655 | RSS: Main: 220069888 08:30:15 INFO - PROCESS | 1655 | 08:31:06 INFO - PROCESS | 1655 | 1477755066333 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 08:33:18 INFO - PROCESS | 1655 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49274/tests/dromaeo/cssquery-ext.html) 08:33:19 INFO - PROCESS | 1655 | RSS: Main: 390746112 08:33:19 INFO - PROCESS | 1655 | 08:36:22 INFO - PROCESS | 1655 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-ext.html (next: http://localhost:49274/tests/dromaeo/cssquery-jquery.html) 08:36:23 INFO - PROCESS | 1655 | RSS: Main: 351154176 08:36:23 INFO - PROCESS | 1655 | 08:39:25 INFO - PROCESS | 1655 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49274/tests/dromaeo/cssquery-mootools.html) 08:39:26 INFO - PROCESS | 1655 | RSS: Main: 328491008 08:39:26 INFO - PROCESS | 1655 | 08:42:28 INFO - PROCESS | 1655 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49274/tests/dromaeo/cssquery-prototype.html) 08:42:29 INFO - PROCESS | 1655 | RSS: Main: 317743104 08:42:29 INFO - PROCESS | 1655 | 08:45:32 INFO - PROCESS | 1655 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49274/tests/dromaeo/cssquery-yui.html) 08:45:33 INFO - PROCESS | 1655 | RSS: Main: 314630144 08:45:33 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-yui.html (next: http://localhost:49274/tests/dromaeo/cssquery-dojo.html) 08:48:36 INFO - PROCESS | 1655 | RSS: Main: 440639488 08:48:36 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | __start_tp_report 08:48:36 INFO - PROCESS | 1655 | _x_x_mozilla_page_load 08:48:36 INFO - PROCESS | 1655 | _x_x_mozilla_page_load_details 08:48:36 INFO - PROCESS | 1655 | |i|pagename|runs| 08:48:36 INFO - PROCESS | 1655 | |0;dojo.html;2806.5228911085114;3340.131565792894;3361.714254288384;3382.985104468659;3409.641987591303;5711.685857277848;5826.679532625714;5868.941310586898;5873.236479257701;5873.618214816034;5777.19119323295;5820.505257053145;5859.6777177255235;5870.178175055485;5883;5230.189320655295;5282.656627319231;5300.125479295912;5319.9202011969855;5348.866278343053;5233.241180028894;5234.659747116444;5381.596380271476;5390.8921821563545;5393.487618676219;5221.660592061523;5303.965726683298;5356.758945847446;5358.812441564526;5376.354837419495;5290.576753859682;5308.495692909187;5331.040412725708;5332.840014799563;5342.171963345649;5207.531322181022;5307.310049693515;5315.069862773999;5323.866903327409;5325.760340784635;5588.6646801191655;5687.687177205252;5721.599488035839;5722.513586345166;5868.501177399926;6067.180930574405;6146.139540464339;6199.50403967686;6286.994080947026;6295.433410993032;5285.68285902847;6269.592476489013;6312.715927783215;6318.43134117927;6326.588771729869;5711.343195532567;5796.710164491758;5837.9124313135335;5845.1816745655215;5860.296764388258;5386.353637563518;6224.62652240867;6288.968555157287;6293.590916590407;6295.716692748837;6131.136251353556;6134.528431832413;6213.316535181127;6227.595206311576;6270.31026587075;5359.3032905722785;6263.655498947511;6299.118123462719;6306.49548036156;6313.684315784192;6216.067589861466;6303.023031430135;6309.179806625109;6311.305756366796;6329.810105696836;6123.709696704001;6176.938230617726;6190.659513726789;6195.132681424604;6265.530085243625;4870.220764677634;4920.901581968341;4928.581070608967;4934.851954441372;4940.975295123501;4373;4428.490723566767;4436.201483732894;4449.377087207794;4459.2865141577195;5809.854753631109;5822.0684690449325;5831.620944638585;5833.474987251083;5838.824835254864;6144.126041557279;6224.813255602339;6237.594556353823;6295.496360291258;6305.621662700252;5744.109663002241;5812.593118481665;5823.155642431909;5833.445822646841;5843.707814609337;5403.594730395157;5405.351357837006;5417.241586177938;5425.050616142159;5432.429594892558;6268.749250029948;6275.560710750295;6323.20959880015;6352.14246076783;6478.902816457851;5311.973440132774;6139.676133582418;6229.221347331583;6278.058291256348;6290.591111577733;6318.778842740482;6321.30465648769;6330.778422755366;6342.429181373698;6411.743530258737;6170.475509581735;6180.381961803783;6214.25428948529;6227.0970709246;6244.750209991731;6136.641621527028;6172.598781079216;6226.657533835682;6251.249850018027;6317.241930968313;6077.453029227391;6144.907826382697;6149.511682777976;6167.660778657217;6182.227221597301;6133.79375043651;6142.017277235621;6143.815685529441;6159.414855588712;6159.692015399301;5797.565182611405;5863.970680146572;5970.313413957277;6047.032474804186;6087;6035.275766907999;6094.695265236809;6098.29869564988;6099.145980130896;6167.475764560063;5130.307408499804;5813.128030795415;5843.8539036522725;6027.939720602738;6090.421409966046 08:48:36 INFO - PROCESS | 1655 | |1;ext.html;512.9894108606046;526.4708967487677;527.5225920541908;548.0846985534156;550.0923476264161;29570.11289661311;29733.702662973363;31494.055178344657;37994.62005379945;38957.831265062094;41441;41634;41832.95417614561;41850.58149418505;42185.73442796713;9735.805283894319;9854.753631159207;9881.110700036996;9907.554160062778;9910.653127140551;9690.27322950778;9810.656627018056;9821.803563928717;9822.950885245564;9848.704538863809;9723.416595004323;9802.5588848502;9863.161631261351;9869.654562090329;9896.455694936776;9743.805123897519;9783;9805.411675299505;9807.362521436084;9814.214862810957;9722.562484688206;9755.853662195073;9825.4104753715;9834.21326293902;9843.507824608812;39229.21541569181;39520.01199969995;39555.60444395548;39706.80146599249;39712.404313935025;3331.267121233349;3494.8602055917986;3532.682058614737;3746.550413950343;3909.4722212501233;28475.857620711762;29022;30386.392272154433;31114.53328200056;31472.685273147432;3168.556402103707;3206.422843888099;3214.8874789382494;3271.7382609391193;3324.7672662913606;517020;517436;517611;518027.4098629483;519007.4049629728;31780.523292150636;32353.838230809168;32364;55887;56337.154942675894;34536;34934.82532587321;35017.824910875286;35076.473852892224;35165.296694065975;14816.555503334917;14911.776323355158;14958.850411495745;14972.625684357761;14976.925115374572;12667.619971400873;12778.488860445477;12787.936060319638;12792.552260670831;12805.807912881315;7677.270659287359;7686.231376862381;7772.883406748903;7776.961115194388;7788.14330423653;3189.728873045817;3229.709326160657;3233.628132764762;3237.773355865114;3265.8040517568547;939.201678573221;956.3879117364892;967.3228739882111;1041.8437234414898;1112.0991996482874;28425.857870710515;29512.557311640343;29645.25886852846;30329;30343.544846827313;1058.1904842795268;1079.5142186016324;1140.4240858366472;1154.7170943118822;1160.8101695761911;14840.62898427548;15270.923645381701;15297.158656274012;15675.921620392053;15779.526614201592;733826;735971.3201433958;739293;739752;740823;55168;55640.72179639076;55659.72170139123;55675.443245567025;55686.44313556812;1228.2139430764319;1253.7868562344424;1338.7857942729117;1360.0275802801045;1379.648189711617;29375.82496700108;30502;30528.84735576308;30573.388532228786;31184.064478065695;47154.764226178646;47714.76142619265;47847.52152478431;47871.76064119657;47937;555339;559562;562682;563067;564483;22941.197058103553;23387.532249354575;25209.11768088108;25778.09776657808;25876.741232587432;43249;45818.77090614659;46145.30782038205;47169.29246061243;47318.580442586775;37890.76536112092;38670.41994370143;38776.80611596924;39809.80095099506;40147.598524014385;37776.43335349917;37796.811015945845;38188;38851.80574097111;39130;37032.62967370292;37520.43719344267;37575.43636845395;37582.62417375791;37879.62120378761;32226.67773322237;34326.48510272398;34331;34469.65530344664;34540.82729586336;20067.498312542302;25016.249512514652;25091.369061010977;25215;25618.743812561635 08:48:36 INFO - PROCESS | 1655 | |2;jquery.html;351.78892664401377;358.46230654018973;372.25548902195624;377.30199131606525;397.8488174493692;15068.397264109437;15262.542123736277;16067.75898361524;20276.59446811063;20656.793432065675;16583;19550.41348759536;20425.693614595755;20615.38153855383;20895.373138805822;4982.476839931809;5640.407757185498;5740.425957404247;6064.9992751196;6077.5137988961;5622.32532096149;5922.289325280973;5973.581849270553;5974.701264936757;6000.2199714037115;5668.433156684319;5833.79581714638;5953;5963.791267305645;6021.939780602203;5804.361520232771;5936.851578710523;5942.673152976607;5943.3165186003735;5949.791757288495;5182.170852663556;5197.714125723083;5200.76596553156;5246.8688282792855;5445.945540544583;13100.803487947689;13173.01202409823;13321.933390332986;13335.399907004208;13351.933240333834;1926.5761532462836;2132.637451633226;2156.6000428331563;2314.976850231493;2738;8595.656173753043;9666.661666841626;9856.112949834478;9880.505974701307;10171.745706357326;1805.6117934644114;1915.5785727140146;1934.3713293179633;1954.6090781843545;2088.8928867700142;114983.11481922891;115510.11224719365;119727.40136299349;124084;131615.99999999904;11076.723081922855;11182.273152245078;11263.324200547993;11389.829152562717;11535.077193824474;14697.338619762137;14701.779473307908;14716.779248311284;14732.779008314883;14747.55757327282;8046.632072547681;8058.476199047043;8858.11418858122;8969.237614802685;8992.325575581857;8419.200175983271;8557.644351609079;8668.176523230282;8734.257588104954;8854.77863053416;4126.401671757579;4314.288142456459;4453.688241823106;4532.501424843264;4565.931511027337;1866.206862083609;1909.8376637985648;1915.6456055629753;1916.5208697825544;1917.4726950088836;769.9615019249015;826.4751882554621;903.7343737558713;932.874062001621;988.461288597716;20134.993250337717;21159.78840211609;21231.150753969978;21362.252321168995;21410.464738381666;946.5267366316841;950.7924935332089;978.574320170728;1011.6307547745167;1041.3595638682307;10638.787224255471;10967.35489676555;11036.282641628268;11038.633216868771;11159.665210043711;629296;635908;640112;641416;643935;70603;81534.59232703799;95272.09455810983;114148;140082;954.4702690007113;983.9754006149903;998.4059484606647;999.93000489965;1003.8092762375126;18587.44237672872;18886.150123244763;19032;19070.90464547724;19076.523086922938;54518.7274063643;54978.725106375816;55388.06141785018;57045;58478.707606463395;78038;80634;82111.5894420548;82281.17718822975;85905;7973.760787176394;10824.891751082703;11459.19785614999;11777.234479758788;11992.460339284578;12611.810822837848;13335.133216340906;13474.797878032034;13828.962827787755;13904.791428128789;9609.279304052085;11548.82676759866;11809.645710628694;11818.645440636794;12010.39948002579;10497;11404.657860264206;11717.589884354347;11987.820182697442;12131.696707582381;10781.946090269812;11472.770544589228;11500.827487587525;11793.29240245588;11988.76022479563;12000.57997970067;12037.578684745991;12081.75836483283;12389.19470234468;12448.25310481374;11524.827127592926;11572.6528204154;11575.942120289345;11662.76674466489;11965.700857478632 08:48:36 INFO - PROCESS | 1655 | |3;mootools.html;1347.2994043097583;1495.2075400037977;1536.3393740691504;1715.5282297368221;1886.9433916982478;7789.337906277966;8338.45800022998;8413.326933845294;8673.3494987876;8688.044315125348;8575.142485751421;8664.220220180183;8669.869951950726;8683.305335573155;8690.782730431742;2378.643203519473;2410.7468715784853;2411.6744239527616;2413.3122060212845;2416.673749043883;2366.538524987628;2392.509535545209;2408.2414039577566;2408.4821763320883;2409.927702168929;2373.2405630198346;2385.355953892448;2399.1123284384803;2401.86789726565;2406.1458182345277;2068.996536679709;2364.6689463475127;2371.786539211479;2374.6081896487144;2377.9048838046456;2325.5348930214027;2353.988230058856;2357.5284943011293;2358.9646155307682;2362.9172978945826;8681.869771953427;8728.214460698504;8830.514321712304;8955.910440895574;8958.910410895938;4314.439122914001;5170.482951704837;5358.812441564526;5385.380681221671;5407.540359069484;3520.7535472516934;3658.304922064799;3713.925721485582;3718.9442158367647;3730.291244663505;1070.3417398300066;1093.278436232083;1104.47537419725;1124.3928278729477;1126.3692332293942;11756.823647645293;11840.703982400422;11848.40757962107;11899.583514576949;11940.46267917937;4458.799354029076;4529.68292219548;4695.600873925686;4695.9530404695515;4709;9227.26181905446;9255.583498742573;9270.536473176315;9278.304127190488;9279.582418791171;5315.28243687105;5316.202569614588;5320.840374788762;5325.547328477045;5329.360476742816;4205.831766729297;4480.798364073625;4585.931211031837;4630.72215667061;4979.30289759434;3802.5627052888717;3834.7699138051807;3881.4760007399204;3892.163184915257;3908.9609103908597;1181.2144923625692;1183.5384200161943;1190.0539071438227;1200.3578085724096;1203.0976767424431;789.5973053742517;918.3800934369408;922.1562270522531;934.3179478980383;957.3107362698846;5741.5119714824705;5765.509931655856;5875.559333050039;5968.791092311748;6246.875062498724;420.3106904676333;434.81085727708546;440.2845376263572;452.46157073082924;456.8675084225604;3472.9826350868084;4001.919961600752;4011.13760541485;4014.3577027675433;4043.353063509824;10471.109955653703;10925.344479331265;10930.945345273223;10938.960798724109;10947.288426252428;10776.622818201326;10849.945750271198;10880.23838331325;10885.619003334845;10895.291806032741;8240.587970601446;8242.423030387816;8242.587870606445;8243.8351232975;8271.048829384577;5324.840254792362;5729;5762.250907382014;5925.377835327401;5945.881082378241;10076.899231007596;10109.090181883666;10165.390076595428;10202.795944081225;10231.693049208536;9254.25965922738;9771.364861283993;10152.137068349273;10157.187425005834;10322.329048611817;7011.859762804817;7240.674169662483;7459.738909138154;7690.769276921701;7691.846163076595;8255;8279.793005174677;8310.127436619068;8352.29005534512;8415.495070295801;7553.773386798405;7560.395168386626;7564.621768911422;7608.733694320672;7668.884966725392;7142.25006374344;7277.526960747535;7362.6318684066655;7397.704091836266;7506.3244308012545;6962.686679099554;7091.468139889425;7097.538659987084;7099.148102227766;7110.3600675939415;4855.465898751064;4873.293372461044;5020.673656212334;5034.043531728959;5147.661607981877;4907.950920490749;4966;5053.444121146745;5072.41667208261;5239.869003274796 08:48:36 INFO - PROCESS | 1655 | |4;prototype.html;277.3648345289288;299.3997035942934;309.8234006616228;311.1815924119567;312.89518011466157;5042.218456139304;5150.819721309755;5222.433270018998;5227.398849132351;5244.0371190277465;4604.930926036112;5068.78349196193;5174.844754657366;5191.896162076766;5239.187925871496;3705.6479634434686;3930.0153422521657;4048.9190216195657;4055.2092341993325;4061.1521757600367;3767.2842159989514;4034.3459181735493;4086.7752273624938;4101.856435024774;4127.525334586516;3881.573026967031;4007.158496715693;4027.4293025719994;4040.4545386372906;4058.8376464941366;3667.899630110969;4014.277430062573;4020.5124104081383;4038.193455548395;4040.898977525556;3117.7973431726864;3510.859565617372;3515.1739341254784;3526.8941931741833;3535.5757309122814;4246.6855563717845;4951.455339912607;5148.974255128738;5152.433232344439;5167.224916262553;4234.745915245065;4364.738115713068;4392.494863090754;4622.352870598119;4624.537546245382;4875.8781030474165;5293.788248470057;5479.506824394891;5518.751656175442;5529.806456774034;2949;3463.515107884898;3748.269087527933;3808.9619103808886;3900.258950799339;5193.454687257821;5234.371875374942;5512.586556008316;5712.258116104252;5852.795152169696;3360.3783300089563;3767.3988554864072;3945.835978386383;3949.782761948063;3964.940525892114;3661.835217415223;4018.6645084579727;4034.5561988181275;4052.3313653246882;4057.472528571267;4554.795034223468;4601.677882548256;4606.976965115153;4619.1685496610935;4647.95352046482;5536.7785288588;5613;5639.577031722637;5654.208410822488;5695.658260504383;1131.9151063670258;1139.8119310313705;1235.8516977962522;1292.915960462567;1308.5158491358068;770.9730159444392;836.8326334733077;898.1602201941206;913.7487191022522;921.0237148622482;4400.779961002001;4829.95170048302;5168.53483186515;5180.8963820723375;5204;4966.677165984272;5314.5216930476445;5412.91880621791;5636.60543761941;5671.156874015961;4343.522212556616;4380.904773806548;4657.906841863144;5015.799368025311;5112.3865136183895;2515.710693270261;2946.587477753116;2962.378295208756;2988.4321978824387;3003.6245469316336;4935.876603084952;5329.360476742816;5350.8495673429625;5425;5875.294964604275;5045.445001049881;5512.4211957744665;5817.214676018768;5845.678487683133;5849.61977471463;5184.351956005499;5304.416514183359;5542.39033706292;5879.5002424794375;5883.676397798162;4691.976540117277;5432.594568404463;5596.3284405871555;5656.8020119295625;5674.404187560247;4796.736179510161;5557.082806431775;5577.609567330248;5585.8773666006655;5588.497035266845;4900.304832342126;5586.514001269396;5775.8556036099435;5817.691019520574;5818.218158197205;3773.58490566043;3802.733808633369;3837.2325534892575;3857.6528112470014;3865.265599536079;5132.3327967364;5134.922976155435;5576.470235327637;5582;5657.575681823962;4798.95201047985;4867.099586576494;5301.814436494704;5492.642978206563;5496.697681627549;5424.7558859850615;5434.3207099112615;5440.238366628754;5459.426760190123;5465.836024919259;4676.4225367593135;5131.846044618667;5292.470752924677;5314.97342513285;5342.973285133549;4772.809087636456;5285.365756109291;5506;5544.41783612731;5545.251391062155;5131.8717032073;5406.189071639285;5418.372089536493;5436.3476382834315;5453.7818487260065 08:48:36 INFO - PROCESS | 1655 | |5;yui.html;677.3463607618648;741.3068780690055;748.8801791713327;812.7935295260197;820.5979070255574;13222.20666759994;15063.397464101436;15584;15589.610259743513;15632.843671563282;13010.438747350332;13032.543860964868;13995.580132596038;14154.71690566188;14176.220307883063;843.3464065349357;851.6891334662835;863.0980625246601;865.5672163918041;865.9350548708841;866.6490071521044;866.653338664533;868.8262347530488;870.7126648206108;871;906.0486489186361;908.9227415669643;910.8815853938979;910.995445022774;912.5574096563195;903.8011637439753;904.2765787370078;906.0803284666069;908.0919080919114;908.1236606674524;669.1802541886151;669.4644284572371;670.4167374384268;670.8825955457776;671.8219671786981;12831.615051548468;12893.613191604267;12915.418806153746;12918.160319579198;12927.09510334277;11774.764504709858;11855.644330670093;12014.219075760135;12058.276503409823;12420.503179872885;10507.474626268733;10552.47237638115;10561.108677472;11141.777164456747;11188.66434006981;3579.266250418658;3700.833462494194;3882.456456096149;3897.0452239201295;3904.2386734586767;122756.38621806924;127676.36161819131;128014.35992820069;128437.43125137538;128482.3575882124;8902.198802107841;9084.81830363389;9154.86267705985;9298.209652179505;9499.857502137473;19054.523636909187;19223.711644325347;19332.42002739892;19370.903145484182;19375.321863734982;7949.443538952218;7962.283394494523;7979.082405523439;7988.720394786154;8050.919490805134;4327.65378769704;4360.585744354281;4379.167958087953;4465.821367145343;4487.5288094749585;3436.896893093211;3591.586967498719;3592.892213233607;3596.424572068509;3598.85604575814;626.0804097260392;634.7334119669749;635.2091645900883;647.9902801457982;648.7567162314132;532.3664838841843;584.7456356484943;623.1587357068013;635.1140159477503;644.2848438233557;8505.404621676424;9207.40151890125;9418.858717119248;9421.481818500048;9439.292053096045;567.5459632294148;591.6716222496556;603.9094135879653;637.4963778614842;653.6306986552582;4300.182965236658;4514.6388288936805;4595.448546174413;4601.148787474328;4603.6777425579885;163311;163451;164632.3536764617;171637.28362716213;173328.1333593324;96354.51822740982;145663;147497;147883;153480.09339579745;85986.57006714927;95292.04707952832;118914;119241;124388.37805810913;8577.742667719978;8715.215630593277;8826.779330516789;8828.867566986628;9022.774430639287;58913.34889929878;58999.705001474715;64156.67921660362;64399.67800160969;67254.99117513339;88934.55532722294;89408.55295723739;90190;92217;94602;12981.221126732049;13110.774200580887;13207.405666744828;13235.801462978256;13335.266560339274;14006.509772157926;14128.929355353157;14774.48289309912;15240;15477.303521341792;12631.93684031574;13557.728845422838;13597.66005849822;13659.386743641273;13784.724305513633;12382.442790074288;13394.464221431423;14324.498642547462;14774.63063423423;14807.407703691732;12285.262884226975;13304.733905322033;13820.378082986088;14064.718705625626;14499;9198.67804626835;11157.49791259379;11355.54577816878;11802.232854864405;12145.757084858431;9621.27840411986;10222.57385540918;10299.588016479256;10487.809700828288;10750.569977200825 08:48:36 INFO - PROCESS | 1655 | __end_tp_report 08:48:36 INFO - PROCESS | 1655 | __start_cc_report 08:48:36 INFO - PROCESS | 1655 | _x_x_mozilla_cycle_collect,1516 08:48:36 INFO - PROCESS | 1655 | __end_cc_report 08:48:36 INFO - PROCESS | 1655 | __startTimestamp1477756116428__endTimestamp 08:48:36 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | ------- Summary: start ------- 08:48:36 INFO - PROCESS | 1655 | Number of tests: 6 08:48:36 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | [#0] dojo.html Cycles:165 Average:5762.00 Median:5873.62 stddev:647.50 (11.0%) stddev-sans-first:606.56 08:48:36 INFO - PROCESS | 1655 | Values: 2806.5 3340.1 3361.7 3383.0 3409.6 5711.7 5826.7 5868.9 5873.2 5873.6 5777.2 5820.5 5859.7 5870.2 5883.0 5230.2 5282.7 5300.1 5319.9 5348.9 5233.2 5234.7 5381.6 5390.9 5393.5 5221.7 5304.0 5356.8 5358.8 5376.4 5290.6 5308.5 5331.0 5332.8 5342.2 5207.5 5307.3 5315.1 5323.9 5325.8 5588.7 5687.7 5721.6 5722.5 5868.5 6067.2 6146.1 6199.5 6287.0 6295.4 5285.7 6269.6 6312.7 6318.4 6326.6 5711.3 5796.7 5837.9 5845.2 5860.3 5386.4 6224.6 6289.0 6293.6 6295.7 6131.1 6134.5 6213.3 6227.6 6270.3 5359.3 6263.7 6299.1 6306.5 6313.7 6216.1 6303.0 6309.2 6311.3 6329.8 6123.7 6176.9 6190.7 6195.1 6265.5 4870.2 4920.9 4928.6 4934.9 4941.0 4373.0 4428.5 4436.2 4449.4 4459.3 5809.9 5822.1 5831.6 5833.5 5838.8 6144.1 6224.8 6237.6 6295.5 6305.6 5744.1 5812.6 5823.2 5833.4 5843.7 5403.6 5405.4 5417.2 5425.1 5432.4 6268.7 6275.6 6323.2 6352.1 6478.9 5312.0 6139.7 6229.2 6278.1 6290.6 6318.8 6321.3 6330.8 6342.4 6411.7 6170.5 6180.4 6214.3 6227.1 6244.8 6136.6 6172.6 6226.7 6251.2 6317.2 6077.5 6144.9 6149.5 6167.7 6182.2 6133.8 6142.0 6143.8 6159.4 6159.7 5797.6 5864.0 5970.3 6047.0 6087.0 6035.3 6094.7 6098.3 6099.1 6167.5 5130.3 5813.1 5843.9 6027.9 6090.4 08:48:36 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | [#1] ext.html Cycles:180 Average:71094.72 Median:38091.31 stddev:164706.93 (432.4%) stddev-sans-first:165083.73 08:48:36 INFO - PROCESS | 1655 | Values: 513.0 526.5 527.5 548.1 550.1 29570.1 29733.7 31494.1 37994.6 38957.8 41441.0 41634.0 41833.0 41850.6 42185.7 9735.8 9854.8 9881.1 9907.6 9910.7 9690.3 9810.7 9821.8 9823.0 9848.7 9723.4 9802.6 9863.2 9869.7 9896.5 9743.8 9783.0 9805.4 9807.4 9814.2 9722.6 9755.9 9825.4 9834.2 9843.5 39229.2 39520.0 39555.6 39706.8 39712.4 3331.3 3494.9 3532.7 3746.6 3909.5 28475.9 29022.0 30386.4 31114.5 31472.7 3168.6 3206.4 3214.9 3271.7 3324.8 517020.0 517436.0 517611.0 518027.4 519007.4 31780.5 32353.8 32364.0 55887.0 56337.2 34536.0 34934.8 35017.8 35076.5 35165.3 14816.6 14911.8 14958.9 14972.6 14976.9 12667.6 12778.5 12787.9 12792.6 12805.8 7677.3 7686.2 7772.9 7777.0 7788.1 3189.7 3229.7 3233.6 3237.8 3265.8 939.2 956.4 967.3 1041.8 1112.1 28425.9 29512.6 29645.3 30329.0 30343.5 1058.2 1079.5 1140.4 1154.7 1160.8 14840.6 15270.9 15297.2 15675.9 15779.5 733826.0 735971.3 739293.0 739752.0 740823.0 55168.0 55640.7 55659.7 55675.4 55686.4 1228.2 1253.8 1338.8 1360.0 1379.6 29375.8 30502.0 30528.8 30573.4 31184.1 47154.8 47714.8 47847.5 47871.8 47937.0 555339.0 559562.0 562682.0 563067.0 564483.0 22941.2 23387.5 25209.1 25778.1 25876.7 43249.0 45818.8 46145.3 47169.3 47318.6 37890.8 38670.4 38776.8 39809.8 40147.6 37776.4 37796.8 38188.0 38851.8 39130.0 37032.6 37520.4 37575.4 37582.6 37879.6 32226.7 34326.5 34331.0 34469.7 34540.8 20067.5 25016.2 25091.4 25215.0 25618.7 08:48:36 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | [#2] jquery.html Cycles:180 Average:35460.54 Median:21027.58 stddev:105805.62 (503.2%) stddev-sans-first:106069.59 08:48:36 INFO - PROCESS | 1655 | Values: 351.8 358.5 372.3 377.3 397.8 15068.4 15262.5 16067.8 20276.6 20656.8 16583.0 19550.4 20425.7 20615.4 20895.4 4982.5 5640.4 5740.4 6065.0 6077.5 5622.3 5922.3 5973.6 5974.7 6000.2 5668.4 5833.8 5953.0 5963.8 6021.9 5804.4 5936.9 5942.7 5943.3 5949.8 5182.2 5197.7 5200.8 5246.9 5445.9 13100.8 13173.0 13321.9 13335.4 13351.9 1926.6 2132.6 2156.6 2315.0 2738.0 8595.7 9666.7 9856.1 9880.5 10171.7 1805.6 1915.6 1934.4 1954.6 2088.9 114983.1 115510.1 119727.4 124084.0 131616.0 11076.7 11182.3 11263.3 11389.8 11535.1 14697.3 14701.8 14716.8 14732.8 14747.6 8046.6 8058.5 8858.1 8969.2 8992.3 8419.2 8557.6 8668.2 8734.3 8854.8 4126.4 4314.3 4453.7 4532.5 4565.9 1866.2 1909.8 1915.6 1916.5 1917.5 770.0 826.5 903.7 932.9 988.5 20135.0 21159.8 21231.2 21362.3 21410.5 946.5 950.8 978.6 1011.6 1041.4 10638.8 10967.4 11036.3 11038.6 11159.7 629296.0 635908.0 640112.0 641416.0 643935.0 70603.0 81534.6 95272.1 114148.0 140082.0 954.5 984.0 998.4 999.9 1003.8 18587.4 18886.2 19032.0 19070.9 19076.5 54518.7 54978.7 55388.1 57045.0 58478.7 78038.0 80634.0 82111.6 82281.2 85905.0 7973.8 10824.9 11459.2 11777.2 11992.5 12611.8 13335.1 13474.8 13829.0 13904.8 9609.3 11548.8 11809.6 11818.6 12010.4 10497.0 11404.7 11717.6 11987.8 12131.7 10781.9 11472.8 11500.8 11793.3 11988.8 12000.6 12037.6 12081.8 12389.2 12448.3 11524.8 11572.7 11575.9 11662.8 11965.7 08:48:36 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | [#3] mootools.html Cycles:180 Average:5684.43 Median:4695.78 stddev:3220.94 (68.6%) stddev-sans-first:3213.48 08:48:36 INFO - PROCESS | 1655 | Values: 1347.3 1495.2 1536.3 1715.5 1886.9 7789.3 8338.5 8413.3 8673.3 8688.0 8575.1 8664.2 8669.9 8683.3 8690.8 2378.6 2410.7 2411.7 2413.3 2416.7 2366.5 2392.5 2408.2 2408.5 2409.9 2373.2 2385.4 2399.1 2401.9 2406.1 2069.0 2364.7 2371.8 2374.6 2377.9 2325.5 2354.0 2357.5 2359.0 2362.9 8681.9 8728.2 8830.5 8955.9 8958.9 4314.4 5170.5 5358.8 5385.4 5407.5 3520.8 3658.3 3713.9 3718.9 3730.3 1070.3 1093.3 1104.5 1124.4 1126.4 11756.8 11840.7 11848.4 11899.6 11940.5 4458.8 4529.7 4695.6 4696.0 4709.0 9227.3 9255.6 9270.5 9278.3 9279.6 5315.3 5316.2 5320.8 5325.5 5329.4 4205.8 4480.8 4585.9 4630.7 4979.3 3802.6 3834.8 3881.5 3892.2 3909.0 1181.2 1183.5 1190.1 1200.4 1203.1 789.6 918.4 922.2 934.3 957.3 5741.5 5765.5 5875.6 5968.8 6246.9 420.3 434.8 440.3 452.5 456.9 3473.0 4001.9 4011.1 4014.4 4043.4 10471.1 10925.3 10930.9 10939.0 10947.3 10776.6 10849.9 10880.2 10885.6 10895.3 8240.6 8242.4 8242.6 8243.8 8271.0 5324.8 5729.0 5762.3 5925.4 5945.9 10076.9 10109.1 10165.4 10202.8 10231.7 9254.3 9771.4 10152.1 10157.2 10322.3 7011.9 7240.7 7459.7 7690.8 7691.8 8255.0 8279.8 8310.1 8352.3 8415.5 7553.8 7560.4 7564.6 7608.7 7668.9 7142.3 7277.5 7362.6 7397.7 7506.3 6962.7 7091.5 7097.5 7099.1 7110.4 4855.5 4873.3 5020.7 5034.0 5147.7 4908.0 4966.0 5053.4 5072.4 5239.9 08:48:36 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | [#4] prototype.html Cycles:180 Average:4456.79 Median:5057.11 stddev:1350.71 (26.7%) stddev-sans-first:1317.57 08:48:36 INFO - PROCESS | 1655 | Values: 277.4 299.4 309.8 311.2 312.9 5042.2 5150.8 5222.4 5227.4 5244.0 4604.9 5068.8 5174.8 5191.9 5239.2 3705.6 3930.0 4048.9 4055.2 4061.2 3767.3 4034.3 4086.8 4101.9 4127.5 3881.6 4007.2 4027.4 4040.5 4058.8 3667.9 4014.3 4020.5 4038.2 4040.9 3117.8 3510.9 3515.2 3526.9 3535.6 4246.7 4951.5 5149.0 5152.4 5167.2 4234.7 4364.7 4392.5 4622.4 4624.5 4875.9 5293.8 5479.5 5518.8 5529.8 2949.0 3463.5 3748.3 3809.0 3900.3 5193.5 5234.4 5512.6 5712.3 5852.8 3360.4 3767.4 3945.8 3949.8 3964.9 3661.8 4018.7 4034.6 4052.3 4057.5 4554.8 4601.7 4607.0 4619.2 4648.0 5536.8 5613.0 5639.6 5654.2 5695.7 1131.9 1139.8 1235.9 1292.9 1308.5 771.0 836.8 898.2 913.7 921.0 4400.8 4830.0 5168.5 5180.9 5204.0 4966.7 5314.5 5412.9 5636.6 5671.2 4343.5 4380.9 4657.9 5015.8 5112.4 2515.7 2946.6 2962.4 2988.4 3003.6 4935.9 5329.4 5350.8 5425.0 5875.3 5045.4 5512.4 5817.2 5845.7 5849.6 5184.4 5304.4 5542.4 5879.5 5883.7 4692.0 5432.6 5596.3 5656.8 5674.4 4796.7 5557.1 5577.6 5585.9 5588.5 4900.3 5586.5 5775.9 5817.7 5818.2 3773.6 3802.7 3837.2 3857.7 3865.3 5132.3 5134.9 5576.5 5582.0 5657.6 4799.0 4867.1 5301.8 5492.6 5496.7 5424.8 5434.3 5440.2 5459.4 5465.8 4676.4 5131.8 5292.5 5315.0 5343.0 4772.8 5285.4 5506.0 5544.4 5545.3 5131.9 5406.2 5418.4 5436.3 5453.8 08:48:36 INFO - PROCESS | 1655 | 08:48:36 INFO - PROCESS | 1655 | [#5] yui.html Cycles:180 Average:25759.41 Median:4313.92 stddev:43223.76 (1002.0%) stddev-sans-first:43303.99 08:48:36 INFO - PROCESS | 1655 | Values: 677.3 741.3 748.9 812.8 820.6 13222.2 15063.4 15584.0 15589.6 15632.8 13010.4 13032.5 13995.6 14154.7 14176.2 843.3 851.7 863.1 865.6 865.9 866.6 866.7 868.8 870.7 871.0 906.0 908.9 910.9 911.0 912.6 903.8 904.3 906.1 908.1 908.1 669.2 669.5 670.4 670.9 671.8 12831.6 12893.6 12915.4 12918.2 12927.1 11774.8 11855.6 12014.2 12058.3 12420.5 10507.5 10552.5 10561.1 11141.8 11188.7 3579.3 3700.8 3882.5 3897.0 3904.2 122756.4 127676.4 128014.4 128437.4 128482.4 8902.2 9084.8 9154.9 9298.2 9499.9 19054.5 19223.7 19332.4 19370.9 19375.3 7949.4 7962.3 7979.1 7988.7 8050.9 4327.7 4360.6 4379.2 4465.8 4487.5 3436.9 3591.6 3592.9 3596.4 3598.9 626.1 634.7 635.2 648.0 648.8 532.4 584.7 623.2 635.1 644.3 8505.4 9207.4 9418.9 9421.5 9439.3 567.5 591.7 603.9 637.5 653.6 4300.2 4514.6 4595.4 4601.1 4603.7 163311.0 163451.0 164632.4 171637.3 173328.1 96354.5 145663.0 147497.0 147883.0 153480.1 85986.6 95292.0 118914.0 119241.0 124388.4 8577.7 8715.2 8826.8 8828.9 9022.8 58913.3 58999.7 64156.7 64399.7 67255.0 88934.6 89408.6 90190.0 92217.0 94602.0 12981.2 13110.8 13207.4 13235.8 13335.3 14006.5 14128.9 14774.5 15240.0 15477.3 12631.9 13557.7 13597.7 13659.4 13784.7 12382.4 13394.5 14324.5 14774.6 14807.4 12285.3 13304.7 13820.4 14064.7 14499.0 9198.7 11157.5 11355.5 11802.2 12145.8 9621.3 10222.6 10299.6 10487.8 10750.6 08:48:36 INFO - PROCESS | 1655 | -------- Summary: end -------- 08:48:36 INFO - PROCESS | 1655 | 08:48:37 INFO - TEST-INFO | 1655: exit 0 08:48:37 INFO - TEST-OK | dromaeo_css | took 1117557ms 08:48:37 INFO - TEST-START | kraken 08:48:37 INFO - operating with platform_type : mac_ 08:48:37 INFO - Initialising browser for kraken test... 08:48:37 INFO - TEST-INFO | started process 1664 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/tmpi1Ou6j/profile http://localhost:49274/getInfo.html) 08:48:39 INFO - PROCESS | 1664 | __metrics Screen width/height:1600/1200 08:48:39 INFO - PROCESS | 1664 | colorDepth:24 08:48:39 INFO - PROCESS | 1664 | Browser inner width/height: 1024/689 08:48:39 INFO - PROCESS | 1664 | __metrics 08:48:39 INFO - PROCESS | 1664 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:48:39 INFO - PROCESS | 1664 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:48:40 INFO - TEST-INFO | 1664: exit 0 08:48:40 INFO - Browser initialized. 08:48:40 INFO - Running cycle 1/1 for kraken test... 08:48:40 INFO - TEST-INFO | started process 1665 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/T/tmpi1Ou6j/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:48:52 INFO - PROCESS | 1665 | RSS: Main: 219525120 08:48:52 INFO - PROCESS | 1665 | 08:48:55 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-beat-detection) 08:48:56 INFO - PROCESS | 1665 | RSS: Main: 269680640 08:48:56 INFO - PROCESS | 1665 | 08:48:58 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-dft) 08:48:59 INFO - PROCESS | 1665 | RSS: Main: 280895488 08:48:59 INFO - PROCESS | 1665 | 08:49:02 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-fft) 08:49:02 INFO - PROCESS | 1665 | RSS: Main: 376766464 08:49:02 INFO - PROCESS | 1665 | 08:49:04 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-oscillator) 08:49:05 INFO - PROCESS | 1665 | RSS: Main: 280793088 08:49:05 INFO - PROCESS | 1665 | 08:49:07 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:49:08 INFO - PROCESS | 1665 | RSS: Main: 281698304 08:49:08 INFO - PROCESS | 1665 | 08:49:10 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-darkroom) 08:49:11 INFO - PROCESS | 1665 | RSS: Main: 318910464 08:49:11 INFO - PROCESS | 1665 | 08:49:14 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-desaturate) 08:49:15 INFO - PROCESS | 1665 | RSS: Main: 318078976 08:49:15 INFO - PROCESS | 1665 | 08:49:17 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49274/tests/kraken/driver.html?testName=json-parse-financial) 08:49:18 INFO - PROCESS | 1665 | RSS: Main: 316510208 08:49:18 INFO - PROCESS | 1665 | 08:49:20 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49274/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:49:20 INFO - PROCESS | 1665 | RSS: Main: 291860480 08:49:20 INFO - PROCESS | 1665 | 08:49:22 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:49:23 INFO - PROCESS | 1665 | RSS: Main: 297361408 08:49:23 INFO - PROCESS | 1665 | 08:49:25 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:49:25 INFO - PROCESS | 1665 | RSS: Main: 300228608 08:49:25 INFO - PROCESS | 1665 | 08:49:28 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:49:29 INFO - PROCESS | 1665 | RSS: Main: 311242752 08:49:29 INFO - PROCESS | 1665 | 08:49:32 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:49:33 INFO - PROCESS | 1665 | RSS: Main: 310550528 08:49:33 INFO - PROCESS | 1665 | 08:49:34 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49274/tests/kraken/driver.html?testName=ai-astar) 08:49:35 INFO - PROCESS | 1665 | RSS: Main: 354340864 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | __start_tp_report 08:49:35 INFO - PROCESS | 1665 | _x_x_mozilla_page_load 08:49:35 INFO - PROCESS | 1665 | _x_x_mozilla_page_load_details 08:49:35 INFO - PROCESS | 1665 | |i|pagename|runs| 08:49:35 INFO - PROCESS | 1665 | |0;ai-astar;116;114;115;113;114;114;114;113;114;114 08:49:35 INFO - PROCESS | 1665 | |1;audio-beat-detection;141;112;108;141;108;110;108;109;137;106 08:49:35 INFO - PROCESS | 1665 | |2;audio-dft;183;181;181;181;187;182;184;184;184;185 08:49:35 INFO - PROCESS | 1665 | |3;audio-fft;81;60;59;88;60;58;57;58;81;58 08:49:35 INFO - PROCESS | 1665 | |4;audio-oscillator;80;72;95;70;68;68;90;68;69;89 08:49:35 INFO - PROCESS | 1665 | |5;imaging-gaussian-blur;90;87;90;86;89;87;91;88;90;86 08:49:35 INFO - PROCESS | 1665 | |6;imaging-darkroom;100;98;99;112;160;124;99;99;99;99 08:49:35 INFO - PROCESS | 1665 | |7;imaging-desaturate;86;87;85;86;85;85;84;83;84;84 08:49:35 INFO - PROCESS | 1665 | |8;json-parse-financial;60;53;53;54;56;57;58;57;59;57 08:49:35 INFO - PROCESS | 1665 | |9;json-stringify-tinderbox;65;68;76;76;72;69;69;69;66;69 08:49:35 INFO - PROCESS | 1665 | |10;stanford-crypto-aes;81;85;82;82;81;81;82;83;85;86 08:49:35 INFO - PROCESS | 1665 | |11;stanford-crypto-ccm;141;150;152;138;137;142;143;147;192;137 08:49:35 INFO - PROCESS | 1665 | |12;stanford-crypto-pbkdf2;165;164;163;162;162;162;163;164;161;161 08:49:35 INFO - PROCESS | 1665 | |13;stanford-crypto-sha256-iterative;67;66;66;67;72;84;82;82;82;64 08:49:35 INFO - PROCESS | 1665 | __end_tp_report 08:49:35 INFO - PROCESS | 1665 | __start_cc_report 08:49:35 INFO - PROCESS | 1665 | _x_x_mozilla_cycle_collect,1995 08:49:35 INFO - PROCESS | 1665 | __end_cc_report 08:49:35 INFO - PROCESS | 1665 | __startTimestamp1477756175111__endTimestamp 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | ------- Summary: start ------- 08:49:35 INFO - PROCESS | 1665 | Number of tests: 14 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#0] ai-astar Cycles:10 Average:114.10 Median:114.00 stddev:0.88 (0.8%) stddev-sans-first:0.60 08:49:35 INFO - PROCESS | 1665 | Values: 116.0 114.0 115.0 113.0 114.0 114.0 114.0 113.0 114.0 114.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#1] audio-beat-detection Cycles:10 Average:118.00 Median:111.00 stddev:15.07 (13.6%) stddev-sans-first:13.49 08:49:35 INFO - PROCESS | 1665 | Values: 141.0 112.0 108.0 141.0 108.0 110.0 108.0 109.0 137.0 106.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#2] audio-dft Cycles:10 Average:183.20 Median:184.00 stddev:1.99 (1.1%) stddev-sans-first:2.11 08:49:35 INFO - PROCESS | 1665 | Values: 183.0 181.0 181.0 181.0 187.0 182.0 184.0 184.0 184.0 185.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#3] audio-fft Cycles:10 Average:66.00 Median:60.00 stddev:12.15 (20.2%) stddev-sans-first:11.61 08:49:35 INFO - PROCESS | 1665 | Values: 81.0 60.0 59.0 88.0 60.0 58.0 57.0 58.0 81.0 58.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#4] audio-oscillator Cycles:10 Average:76.90 Median:76.00 stddev:10.68 (14.1%) stddev-sans-first:11.27 08:49:35 INFO - PROCESS | 1665 | Values: 80.0 72.0 95.0 70.0 68.0 68.0 90.0 68.0 69.0 89.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#5] imaging-gaussian-blur Cycles:10 Average:88.40 Median:89.50 stddev:1.84 (2.1%) stddev-sans-first:1.86 08:49:35 INFO - PROCESS | 1665 | Values: 90.0 87.0 90.0 86.0 89.0 87.0 91.0 88.0 90.0 86.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#6] imaging-darkroom Cycles:10 Average:108.90 Median:99.00 stddev:19.82 (20.0%) stddev-sans-first:20.76 08:49:35 INFO - PROCESS | 1665 | Values: 100.0 98.0 99.0 112.0 160.0 124.0 99.0 99.0 99.0 99.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#7] imaging-desaturate Cycles:10 Average:84.90 Median:85.00 stddev:1.20 (1.4%) stddev-sans-first:1.20 08:49:35 INFO - PROCESS | 1665 | Values: 86.0 87.0 85.0 86.0 85.0 85.0 84.0 83.0 84.0 84.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#8] json-parse-financial Cycles:10 Average:56.40 Median:57.00 stddev:2.41 (4.2%) stddev-sans-first:2.18 08:49:35 INFO - PROCESS | 1665 | Values: 60.0 53.0 53.0 54.0 56.0 57.0 58.0 57.0 59.0 57.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#9] json-stringify-tinderbox Cycles:10 Average:69.90 Median:69.00 stddev:3.73 (5.4%) stddev-sans-first:3.50 08:49:35 INFO - PROCESS | 1665 | Values: 65.0 68.0 76.0 76.0 72.0 69.0 69.0 69.0 66.0 69.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#10] stanford-crypto-aes Cycles:10 Average:82.80 Median:82.50 stddev:1.87 (2.3%) stddev-sans-first:1.87 08:49:35 INFO - PROCESS | 1665 | Values: 81.0 85.0 82.0 82.0 81.0 81.0 82.0 83.0 85.0 86.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#11] stanford-crypto-ccm Cycles:10 Average:147.90 Median:145.00 stddev:16.36 (11.3%) stddev-sans-first:17.16 08:49:35 INFO - PROCESS | 1665 | Values: 141.0 150.0 152.0 138.0 137.0 142.0 143.0 147.0 192.0 137.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:162.70 Median:163.00 stddev:1.34 (0.8%) stddev-sans-first:1.13 08:49:35 INFO - PROCESS | 1665 | Values: 165.0 164.0 163.0 162.0 162.0 162.0 163.0 164.0 161.0 161.0 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - PROCESS | 1665 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:73.20 Median:77.00 stddev:8.27 (10.7%) stddev-sans-first:8.46 08:49:35 INFO - PROCESS | 1665 | Values: 67.0 66.0 66.0 67.0 72.0 84.0 82.0 82.0 82.0 64.0 08:49:35 INFO - PROCESS | 1665 | -------- Summary: end -------- 08:49:35 INFO - PROCESS | 1665 | 08:49:35 INFO - TEST-INFO | 1665: exit 0 08:49:35 INFO - TEST-OK | kraken | took 58906ms 08:49:35 INFO - SUITE-END | took 1176s 08:49:36 INFO - Completed test suite (00:19:36) 08:49:36 INFO - javascript benchmark 08:49:36 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2806.5228911085114, 3340.131565792894, 3361.714254288384, 3382.985104468659, 3409.641987591303, 5711.685857277848, 5826.679532625714, 5868.941310586898, 5873.236479257701, 5873.618214816034, 5777.19119323295, 5820.505257053145, 5859.6777177255235, 5870.178175055485, 5883.0, 5230.189320655295, 5282.656627319231, 5300.125479295912, 5319.9202011969855, 5348.866278343053, 5233.241180028894, 5234.659747116444, 5381.596380271476, 5390.8921821563545, 5393.487618676219, 5221.660592061523, 5303.965726683298, 5356.758945847446, 5358.812441564526, 5376.354837419495, 5290.576753859682, 5308.495692909187, 5331.040412725708, 5332.840014799563, 5342.171963345649, 5207.531322181022, 5307.310049693515, 5315.069862773999, 5323.866903327409, 5325.760340784635, 5588.6646801191655, 5687.687177205252, 5721.599488035839, 5722.513586345166, 5868.501177399926, 6067.180930574405, 6146.139540464339, 6199.50403967686, 6286.994080947026, 6295.433410993032, 5285.68285902847, 6269.592476489013, 6312.715927783215, 6318.43134117927, 6326.588771729869, 5711.343195532567, 5796.710164491758, 5837.9124313135335, 5845.1816745655215, 5860.296764388258, 5386.353637563518, 6224.62652240867, 6288.968555157287, 6293.590916590407, 6295.716692748837, 6131.136251353556, 6134.528431832413, 6213.316535181127, 6227.595206311576, 6270.31026587075, 5359.3032905722785, 6263.655498947511, 6299.118123462719, 6306.49548036156, 6313.684315784192, 6216.067589861466, 6303.023031430135, 6309.179806625109, 6311.305756366796, 6329.810105696836, 6123.709696704001, 6176.938230617726, 6190.659513726789, 6195.132681424604, 6265.530085243625, 4870.220764677634, 4920.901581968341, 4928.581070608967, 4934.851954441372, 4940.975295123501, 4373.0, 4428.490723566767, 4436.201483732894, 4449.377087207794, 4459.2865141577195, 5809.854753631109, 5822.0684690449325, 5831.620944638585, 5833.474987251083, 5838.824835254864, 6144.126041557279, 6224.813255602339, 6237.594556353823, 6295.496360291258, 6305.621662700252, 5744.109663002241, 5812.593118481665, 5823.155642431909, 5833.445822646841, 5843.707814609337, 5403.594730395157, 5405.351357837006, 5417.241586177938, 5425.050616142159, 5432.429594892558, 6268.749250029948, 6275.560710750295, 6323.20959880015, 6352.14246076783, 6478.902816457851, 5311.973440132774, 6139.676133582418, 6229.221347331583, 6278.058291256348, 6290.591111577733, 6318.778842740482, 6321.30465648769, 6330.778422755366, 6342.429181373698, 6411.743530258737, 6170.475509581735, 6180.381961803783, 6214.25428948529, 6227.0970709246, 6244.750209991731, 6136.641621527028, 6172.598781079216, 6226.657533835682, 6251.249850018027, 6317.241930968313, 6077.453029227391, 6144.907826382697, 6149.511682777976, 6167.660778657217, 6182.227221597301, 6133.79375043651, 6142.017277235621, 6143.815685529441, 6159.414855588712, 6159.692015399301, 5797.565182611405, 5863.970680146572, 5970.313413957277, 6047.032474804186, 6087.0, 6035.275766907999, 6094.695265236809, 6098.29869564988, 6099.145980130896, 6167.475764560063, 5130.307408499804, 5813.128030795415, 5843.8539036522725, 6027.939720602738, 6090.421409966046], "value": 5720.143551964012, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [512.9894108606046, 526.4708967487677, 527.5225920541908, 548.0846985534156, 550.0923476264161, 29570.11289661311, 29733.702662973363, 31494.055178344657, 37994.62005379945, 38957.831265062094, 41441.0, 41634.0, 41832.95417614561, 41850.58149418505, 42185.73442796713, 9735.805283894319, 9854.753631159207, 9881.110700036996, 9907.554160062778, 9910.653127140551, 9690.27322950778, 9810.656627018056, 9821.803563928717, 9822.950885245564, 9848.704538863809, 9723.416595004323, 9802.5588848502, 9863.161631261351, 9869.654562090329, 9896.455694936776, 9743.805123897519, 9783.0, 9805.411675299505, 9807.362521436084, 9814.214862810957, 9722.562484688206, 9755.853662195073, 9825.4104753715, 9834.21326293902, 9843.507824608812, 39229.21541569181, 39520.01199969995, 39555.60444395548, 39706.80146599249, 39712.404313935025, 3331.267121233349, 3494.8602055917986, 3532.682058614737, 3746.550413950343, 3909.4722212501233, 28475.857620711762, 29022.0, 30386.392272154433, 31114.53328200056, 31472.685273147432, 3168.556402103707, 3206.422843888099, 3214.8874789382494, 3271.7382609391193, 3324.7672662913606, 517020.0, 517436.0, 517611.0, 518027.4098629483, 519007.4049629728, 31780.523292150636, 32353.838230809168, 32364.0, 55887.0, 56337.154942675894, 34536.0, 34934.82532587321, 35017.824910875286, 35076.473852892224, 35165.296694065975, 14816.555503334917, 14911.776323355158, 14958.850411495745, 14972.625684357761, 14976.925115374572, 12667.619971400873, 12778.488860445477, 12787.936060319638, 12792.552260670831, 12805.807912881315, 7677.270659287359, 7686.231376862381, 7772.883406748903, 7776.961115194388, 7788.14330423653, 3189.728873045817, 3229.709326160657, 3233.628132764762, 3237.773355865114, 3265.8040517568547, 939.201678573221, 956.3879117364892, 967.3228739882111, 1041.8437234414898, 1112.0991996482874, 28425.857870710515, 29512.557311640343, 29645.25886852846, 30329.0, 30343.544846827313, 1058.1904842795268, 1079.5142186016324, 1140.4240858366472, 1154.7170943118822, 1160.8101695761911, 14840.62898427548, 15270.923645381701, 15297.158656274012, 15675.921620392053, 15779.526614201592, 733826.0, 735971.3201433958, 739293.0, 739752.0, 740823.0, 55168.0, 55640.72179639076, 55659.72170139123, 55675.443245567025, 55686.44313556812, 1228.2139430764319, 1253.7868562344424, 1338.7857942729117, 1360.0275802801045, 1379.648189711617, 29375.82496700108, 30502.0, 30528.84735576308, 30573.388532228786, 31184.064478065695, 47154.764226178646, 47714.76142619265, 47847.52152478431, 47871.76064119657, 47937.0, 555339.0, 559562.0, 562682.0, 563067.0, 564483.0, 22941.197058103553, 23387.532249354575, 25209.11768088108, 25778.09776657808, 25876.741232587432, 43249.0, 45818.77090614659, 46145.30782038205, 47169.29246061243, 47318.580442586775, 37890.76536112092, 38670.41994370143, 38776.80611596924, 39809.80095099506, 40147.598524014385, 37776.43335349917, 37796.811015945845, 38188.0, 38851.80574097111, 39130.0, 37032.62967370292, 37520.43719344267, 37575.43636845395, 37582.62417375791, 37879.62120378761, 32226.67773322237, 34326.48510272398, 34331.0, 34469.65530344664, 34540.82729586336, 20067.498312542302, 25016.249512514652, 25091.369061010977, 25215.0, 25618.743812561635], "value": 18482.1214304155, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [351.78892664401377, 358.46230654018973, 372.25548902195624, 377.30199131606525, 397.8488174493692, 15068.397264109437, 15262.542123736277, 16067.75898361524, 20276.59446811063, 20656.793432065675, 16583.0, 19550.41348759536, 20425.693614595755, 20615.38153855383, 20895.373138805822, 4982.476839931809, 5640.407757185498, 5740.425957404247, 6064.9992751196, 6077.5137988961, 5622.32532096149, 5922.289325280973, 5973.581849270553, 5974.701264936757, 6000.2199714037115, 5668.433156684319, 5833.79581714638, 5953.0, 5963.791267305645, 6021.939780602203, 5804.361520232771, 5936.851578710523, 5942.673152976607, 5943.3165186003735, 5949.791757288495, 5182.170852663556, 5197.714125723083, 5200.76596553156, 5246.8688282792855, 5445.945540544583, 13100.803487947689, 13173.01202409823, 13321.933390332986, 13335.399907004208, 13351.933240333834, 1926.5761532462836, 2132.637451633226, 2156.6000428331563, 2314.976850231493, 2738.0, 8595.656173753043, 9666.661666841626, 9856.112949834478, 9880.505974701307, 10171.745706357326, 1805.6117934644114, 1915.5785727140146, 1934.3713293179633, 1954.6090781843545, 2088.8928867700142, 114983.11481922891, 115510.11224719365, 119727.40136299349, 124084.0, 131615.99999999904, 11076.723081922855, 11182.273152245078, 11263.324200547993, 11389.829152562717, 11535.077193824474, 14697.338619762137, 14701.779473307908, 14716.779248311284, 14732.779008314883, 14747.55757327282, 8046.632072547681, 8058.476199047043, 8858.11418858122, 8969.237614802685, 8992.325575581857, 8419.200175983271, 8557.644351609079, 8668.176523230282, 8734.257588104954, 8854.77863053416, 4126.401671757579, 4314.288142456459, 4453.688241823106, 4532.501424843264, 4565.931511027337, 1866.206862083609, 1909.8376637985648, 1915.6456055629753, 1916.5208697825544, 1917.4726950088836, 769.9615019249015, 826.4751882554621, 903.7343737558713, 932.874062001621, 988.461288597716, 20134.993250337717, 21159.78840211609, 21231.150753969978, 21362.252321168995, 21410.464738381666, 946.5267366316841, 950.7924935332089, 978.574320170728, 1011.6307547745167, 1041.3595638682307, 10638.787224255471, 10967.35489676555, 11036.282641628268, 11038.633216868771, 11159.665210043711, 629296.0, 635908.0, 640112.0, 641416.0, 643935.0, 70603.0, 81534.59232703799, 95272.09455810983, 114148.0, 140082.0, 954.4702690007113, 983.9754006149903, 998.4059484606647, 999.93000489965, 1003.8092762375126, 18587.44237672872, 18886.150123244763, 19032.0, 19070.90464547724, 19076.523086922938, 54518.7274063643, 54978.725106375816, 55388.06141785018, 57045.0, 58478.707606463395, 78038.0, 80634.0, 82111.5894420548, 82281.17718822975, 85905.0, 7973.760787176394, 10824.891751082703, 11459.19785614999, 11777.234479758788, 11992.460339284578, 12611.810822837848, 13335.133216340906, 13474.797878032034, 13828.962827787755, 13904.791428128789, 9609.279304052085, 11548.82676759866, 11809.645710628694, 11818.645440636794, 12010.39948002579, 10497.0, 11404.657860264206, 11717.589884354347, 11987.820182697442, 12131.696707582381, 10781.946090269812, 11472.770544589228, 11500.827487587525, 11793.29240245588, 11988.76022479563, 12000.57997970067, 12037.578684745991, 12081.75836483283, 12389.19470234468, 12448.25310481374, 11524.827127592926, 11572.6528204154, 11575.942120289345, 11662.76674466489, 11965.700857478632], "value": 9549.067417211869, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1347.2994043097583, 1495.2075400037977, 1536.3393740691504, 1715.5282297368221, 1886.9433916982478, 7789.337906277966, 8338.45800022998, 8413.326933845294, 8673.3494987876, 8688.044315125348, 8575.142485751421, 8664.220220180183, 8669.869951950726, 8683.305335573155, 8690.782730431742, 2378.643203519473, 2410.7468715784853, 2411.6744239527616, 2413.3122060212845, 2416.673749043883, 2366.538524987628, 2392.509535545209, 2408.2414039577566, 2408.4821763320883, 2409.927702168929, 2373.2405630198346, 2385.355953892448, 2399.1123284384803, 2401.86789726565, 2406.1458182345277, 2068.996536679709, 2364.6689463475127, 2371.786539211479, 2374.6081896487144, 2377.9048838046456, 2325.5348930214027, 2353.988230058856, 2357.5284943011293, 2358.9646155307682, 2362.9172978945826, 8681.869771953427, 8728.214460698504, 8830.514321712304, 8955.910440895574, 8958.910410895938, 4314.439122914001, 5170.482951704837, 5358.812441564526, 5385.380681221671, 5407.540359069484, 3520.7535472516934, 3658.304922064799, 3713.925721485582, 3718.9442158367647, 3730.291244663505, 1070.3417398300066, 1093.278436232083, 1104.47537419725, 1124.3928278729477, 1126.3692332293942, 11756.823647645293, 11840.703982400422, 11848.40757962107, 11899.583514576949, 11940.46267917937, 4458.799354029076, 4529.68292219548, 4695.600873925686, 4695.9530404695515, 4709.0, 9227.26181905446, 9255.583498742573, 9270.536473176315, 9278.304127190488, 9279.582418791171, 5315.28243687105, 5316.202569614588, 5320.840374788762, 5325.547328477045, 5329.360476742816, 4205.831766729297, 4480.798364073625, 4585.931211031837, 4630.72215667061, 4979.30289759434, 3802.5627052888717, 3834.7699138051807, 3881.4760007399204, 3892.163184915257, 3908.9609103908597, 1181.2144923625692, 1183.5384200161943, 1190.0539071438227, 1200.3578085724096, 1203.0976767424431, 789.5973053742517, 918.3800934369408, 922.1562270522531, 934.3179478980383, 957.3107362698846, 5741.5119714824705, 5765.509931655856, 5875.559333050039, 5968.791092311748, 6246.875062498724, 420.3106904676333, 434.81085727708546, 440.2845376263572, 452.46157073082924, 456.8675084225604, 3472.9826350868084, 4001.919961600752, 4011.13760541485, 4014.3577027675433, 4043.353063509824, 10471.109955653703, 10925.344479331265, 10930.945345273223, 10938.960798724109, 10947.288426252428, 10776.622818201326, 10849.945750271198, 10880.23838331325, 10885.619003334845, 10895.291806032741, 8240.587970601446, 8242.423030387816, 8242.587870606445, 8243.8351232975, 8271.048829384577, 5324.840254792362, 5729.0, 5762.250907382014, 5925.377835327401, 5945.881082378241, 10076.899231007596, 10109.090181883666, 10165.390076595428, 10202.795944081225, 10231.693049208536, 9254.25965922738, 9771.364861283993, 10152.137068349273, 10157.187425005834, 10322.329048611817, 7011.859762804817, 7240.674169662483, 7459.738909138154, 7690.769276921701, 7691.846163076595, 8255.0, 8279.793005174677, 8310.127436619068, 8352.29005534512, 8415.495070295801, 7553.773386798405, 7560.395168386626, 7564.621768911422, 7608.733694320672, 7668.884966725392, 7142.25006374344, 7277.526960747535, 7362.6318684066655, 7397.704091836266, 7506.3244308012545, 6962.686679099554, 7091.468139889425, 7097.538659987084, 7099.148102227766, 7110.3600675939415, 4855.465898751064, 4873.293372461044, 5020.673656212334, 5034.043531728959, 5147.661607981877, 4907.950920490749, 4966.0, 5053.444121146745, 5072.41667208261, 5239.869003274796], "value": 4484.167971401508, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [277.3648345289288, 299.3997035942934, 309.8234006616228, 311.1815924119567, 312.89518011466157, 5042.218456139304, 5150.819721309755, 5222.433270018998, 5227.398849132351, 5244.0371190277465, 4604.930926036112, 5068.78349196193, 5174.844754657366, 5191.896162076766, 5239.187925871496, 3705.6479634434686, 3930.0153422521657, 4048.9190216195657, 4055.2092341993325, 4061.1521757600367, 3767.2842159989514, 4034.3459181735493, 4086.7752273624938, 4101.856435024774, 4127.525334586516, 3881.573026967031, 4007.158496715693, 4027.4293025719994, 4040.4545386372906, 4058.8376464941366, 3667.899630110969, 4014.277430062573, 4020.5124104081383, 4038.193455548395, 4040.898977525556, 3117.7973431726864, 3510.859565617372, 3515.1739341254784, 3526.8941931741833, 3535.5757309122814, 4246.6855563717845, 4951.455339912607, 5148.974255128738, 5152.433232344439, 5167.224916262553, 4234.745915245065, 4364.738115713068, 4392.494863090754, 4622.352870598119, 4624.537546245382, 4875.8781030474165, 5293.788248470057, 5479.506824394891, 5518.751656175442, 5529.806456774034, 2949.0, 3463.515107884898, 3748.269087527933, 3808.9619103808886, 3900.258950799339, 5193.454687257821, 5234.371875374942, 5512.586556008316, 5712.258116104252, 5852.795152169696, 3360.3783300089563, 3767.3988554864072, 3945.835978386383, 3949.782761948063, 3964.940525892114, 3661.835217415223, 4018.6645084579727, 4034.5561988181275, 4052.3313653246882, 4057.472528571267, 4554.795034223468, 4601.677882548256, 4606.976965115153, 4619.1685496610935, 4647.95352046482, 5536.7785288588, 5613.0, 5639.577031722637, 5654.208410822488, 5695.658260504383, 1131.9151063670258, 1139.8119310313705, 1235.8516977962522, 1292.915960462567, 1308.5158491358068, 770.9730159444392, 836.8326334733077, 898.1602201941206, 913.7487191022522, 921.0237148622482, 4400.779961002001, 4829.95170048302, 5168.53483186515, 5180.8963820723375, 5204.0, 4966.677165984272, 5314.5216930476445, 5412.91880621791, 5636.60543761941, 5671.156874015961, 4343.522212556616, 4380.904773806548, 4657.906841863144, 5015.799368025311, 5112.3865136183895, 2515.710693270261, 2946.587477753116, 2962.378295208756, 2988.4321978824387, 3003.6245469316336, 4935.876603084952, 5329.360476742816, 5350.8495673429625, 5425.0, 5875.294964604275, 5045.445001049881, 5512.4211957744665, 5817.214676018768, 5845.678487683133, 5849.61977471463, 5184.351956005499, 5304.416514183359, 5542.39033706292, 5879.5002424794375, 5883.676397798162, 4691.976540117277, 5432.594568404463, 5596.3284405871555, 5656.8020119295625, 5674.404187560247, 4796.736179510161, 5557.082806431775, 5577.609567330248, 5585.8773666006655, 5588.497035266845, 4900.304832342126, 5586.514001269396, 5775.8556036099435, 5817.691019520574, 5818.218158197205, 3773.58490566043, 3802.733808633369, 3837.2325534892575, 3857.6528112470014, 3865.265599536079, 5132.3327967364, 5134.922976155435, 5576.470235327637, 5582.0, 5657.575681823962, 4798.95201047985, 4867.099586576494, 5301.814436494704, 5492.642978206563, 5496.697681627549, 5424.7558859850615, 5434.3207099112615, 5440.238366628754, 5459.426760190123, 5465.836024919259, 4676.4225367593135, 5131.846044618667, 5292.470752924677, 5314.97342513285, 5342.973285133549, 4772.809087636456, 5285.365756109291, 5506.0, 5544.41783612731, 5545.251391062155, 5131.8717032073, 5406.189071639285, 5418.372089536493, 5436.3476382834315, 5453.7818487260065], "value": 4020.3191623014045, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [677.3463607618648, 741.3068780690055, 748.8801791713327, 812.7935295260197, 820.5979070255574, 13222.20666759994, 15063.397464101436, 15584.0, 15589.610259743513, 15632.843671563282, 13010.438747350332, 13032.543860964868, 13995.580132596038, 14154.71690566188, 14176.220307883063, 843.3464065349357, 851.6891334662835, 863.0980625246601, 865.5672163918041, 865.9350548708841, 866.6490071521044, 866.653338664533, 868.8262347530488, 870.7126648206108, 871.0, 906.0486489186361, 908.9227415669643, 910.8815853938979, 910.995445022774, 912.5574096563195, 903.8011637439753, 904.2765787370078, 906.0803284666069, 908.0919080919114, 908.1236606674524, 669.1802541886151, 669.4644284572371, 670.4167374384268, 670.8825955457776, 671.8219671786981, 12831.615051548468, 12893.613191604267, 12915.418806153746, 12918.160319579198, 12927.09510334277, 11774.764504709858, 11855.644330670093, 12014.219075760135, 12058.276503409823, 12420.503179872885, 10507.474626268733, 10552.47237638115, 10561.108677472, 11141.777164456747, 11188.66434006981, 3579.266250418658, 3700.833462494194, 3882.456456096149, 3897.0452239201295, 3904.2386734586767, 122756.38621806924, 127676.36161819131, 128014.35992820069, 128437.43125137538, 128482.3575882124, 8902.198802107841, 9084.81830363389, 9154.86267705985, 9298.209652179505, 9499.857502137473, 19054.523636909187, 19223.711644325347, 19332.42002739892, 19370.903145484182, 19375.321863734982, 7949.443538952218, 7962.283394494523, 7979.082405523439, 7988.720394786154, 8050.919490805134, 4327.65378769704, 4360.585744354281, 4379.167958087953, 4465.821367145343, 4487.5288094749585, 3436.896893093211, 3591.586967498719, 3592.892213233607, 3596.424572068509, 3598.85604575814, 626.0804097260392, 634.7334119669749, 635.2091645900883, 647.9902801457982, 648.7567162314132, 532.3664838841843, 584.7456356484943, 623.1587357068013, 635.1140159477503, 644.2848438233557, 8505.404621676424, 9207.40151890125, 9418.858717119248, 9421.481818500048, 9439.292053096045, 567.5459632294148, 591.6716222496556, 603.9094135879653, 637.4963778614842, 653.6306986552582, 4300.182965236658, 4514.6388288936805, 4595.448546174413, 4601.148787474328, 4603.6777425579885, 163311.0, 163451.0, 164632.3536764617, 171637.28362716213, 173328.1333593324, 96354.51822740982, 145663.0, 147497.0, 147883.0, 153480.09339579745, 85986.57006714927, 95292.04707952832, 118914.0, 119241.0, 124388.37805810913, 8577.742667719978, 8715.215630593277, 8826.779330516789, 8828.867566986628, 9022.774430639287, 58913.34889929878, 58999.705001474715, 64156.67921660362, 64399.67800160969, 67254.99117513339, 88934.55532722294, 89408.55295723739, 90190.0, 92217.0, 94602.0, 12981.221126732049, 13110.774200580887, 13207.405666744828, 13235.801462978256, 13335.266560339274, 14006.509772157926, 14128.929355353157, 14774.48289309912, 15240.0, 15477.303521341792, 12631.93684031574, 13557.728845422838, 13597.66005849822, 13659.386743641273, 13784.724305513633, 12382.442790074288, 13394.464221431423, 14324.498642547462, 14774.63063423423, 14807.407703691732, 12285.262884226975, 13304.733905322033, 13820.378082986088, 14064.718705625626, 14499.0, 9198.67804626835, 11157.49791259379, 11355.54577816878, 11802.232854864405, 12145.757084858431, 9621.27840411986, 10222.57385540918, 10299.588016479256, 10487.809700828288, 10750.569977200825], "value": 7698.4329559705675, "unit": "score"}], "name": "dromaeo_css", "value": 7206.950011432839, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 114.0, 115.0, 113.0, 114.0, 114.0, 114.0, 113.0, 114.0, 114.0], "value": 114.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 112.0, 108.0, 141.0, 108.0, 110.0, 108.0, 109.0, 137.0, 106.0], "value": 118.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [183.0, 181.0, 181.0, 181.0, 187.0, 182.0, 184.0, 184.0, 184.0, 185.0], "value": 183.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 60.0, 59.0, 88.0, 60.0, 58.0, 57.0, 58.0, 81.0, 58.0], "value": 66.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 72.0, 95.0, 70.0, 68.0, 68.0, 90.0, 68.0, 69.0, 89.0], "value": 76.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 87.0, 90.0, 86.0, 89.0, 87.0, 91.0, 88.0, 90.0, 86.0], "value": 88.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 98.0, 99.0, 112.0, 160.0, 124.0, 99.0, 99.0, 99.0, 99.0], "value": 108.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 87.0, 85.0, 86.0, 85.0, 85.0, 84.0, 83.0, 84.0, 84.0], "value": 84.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 53.0, 53.0, 54.0, 56.0, 57.0, 58.0, 57.0, 59.0, 57.0], "value": 56.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 68.0, 76.0, 76.0, 72.0, 69.0, 69.0, 69.0, 66.0, 69.0], "value": 69.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 85.0, 82.0, 82.0, 81.0, 81.0, 82.0, 83.0, 85.0, 86.0], "value": 82.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 150.0, 152.0, 138.0, 137.0, 142.0, 143.0, 147.0, 192.0, 137.0], "value": 147.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 164.0, 163.0, 162.0, 162.0, 162.0, 163.0, 164.0, 161.0, 161.0], "value": 162.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 66.0, 66.0, 67.0, 72.0, 84.0, 82.0, 82.0, 82.0, 64.0], "value": 73.2, "unit": "score"}], "name": "kraken", "value": 1433.3, "alertThreshold": 2.0}]} 08:49:36 INFO - Return code: 0 08:49:36 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:49:36 INFO - # TBPL SUCCESS # 08:49:36 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:49:36 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:49:36 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:49:36 INFO - 2016-10-29 08:49:36.457 screenresolution[1669:9857] starting screenresolution argv=screenresolution get 08:49:36 INFO - 2016-10-29 08:49:36.460 screenresolution[1669:9857] Display 0: 1600x1200x32@60 08:49:36 INFO - 2016-10-29 08:49:36.465 screenresolution[1670:9860] starting screenresolution argv=screenresolution list 08:49:36 INFO - Available Modes on Display 0 08:49:36 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:49:36 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:49:36 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:49:36 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:49:36 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:49:36 INFO - Intel Iris: 08:49:36 INFO - Chipset Model: Intel Iris 08:49:36 INFO - Type: GPU 08:49:36 INFO - Bus: Built-In 08:49:36 INFO - VRAM (Dynamic, Max): 1536 MB 08:49:36 INFO - Vendor: Intel (0x8086) 08:49:36 INFO - Device ID: 0x0a2e 08:49:36 INFO - Revision ID: 0x0009 08:49:36 INFO - Displays: 08:49:36 INFO - Display: 08:49:36 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:49:36 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:49:36 INFO - Display Serial Number: 1600x1200 60 08:49:36 INFO - Main Display: Yes 08:49:36 INFO - Mirror: Off 08:49:36 INFO - Online: Yes 08:49:36 INFO - Rotation: Supported 08:49:36 INFO - Return code: 0 08:49:36 INFO - Running post-action listener: _resource_record_post_action 08:49:36 INFO - [mozharness: 2016-10-29 15:49:36.701988Z] Finished run-tests step (success) 08:49:36 INFO - Running post-run listener: _resource_record_post_run 08:49:36 INFO - Total resource usage - Wall time: 1210s; CPU: 54.0%; Read bytes: 38806528; Write bytes: 661898752; Read time: 388; Write time: 1849 08:49:36 INFO - TinderboxPrint: CPU usage
53.6% 08:49:36 INFO - TinderboxPrint: I/O read bytes / time
38,806,528 / 388 08:49:36 INFO - TinderboxPrint: I/O write bytes / time
661,898,752 / 1,849 08:49:36 INFO - TinderboxPrint: CPU idle
2,244.4 (46.4%) 08:49:36 INFO - TinderboxPrint: CPU system
975.6 (20.2%) 08:49:36 INFO - TinderboxPrint: CPU user
1,621.7 (33.5%) 08:49:36 INFO - TinderboxPrint: Swap in / out
402,100,224 / 0 08:49:36 INFO - install - Wall time: 33s; CPU: 55.0%; Read bytes: 354996736; Write bytes: 355297280; Read time: 27872; Write time: 666 08:49:36 INFO - run-tests - Wall time: 1178s; CPU: 54.0%; Read bytes: 37831680; Write bytes: 296447488; Read time: 372; Write time: 1152 08:49:37 INFO - Running post-run listener: _upload_blobber_files 08:49:37 INFO - Blob upload gear active. 08:49:37 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:49:37 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 08:49:37 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'] 08:49:37 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 08:49:37 INFO - (blobuploader) - INFO - Open directory for files ... 08:49:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:49:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:49:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:49:38 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:49:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:49:38 INFO - (blobuploader) - INFO - Done attempting. 08:49:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:49:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:49:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:49:39 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:49:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:49:39 INFO - (blobuploader) - INFO - Done attempting. 08:49:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:49:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:49:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:49:42 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:49:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:49:42 INFO - (blobuploader) - INFO - Done attempting. 08:49:42 INFO - (blobuploader) - INFO - Iteration through files over. 08:49:42 INFO - Return code: 0 08:49:42 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:49:42 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:49:42 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/48fdd4bc9e08440b23b3d548a66b7e993d068b19f6f17975b6de5e33ffbdbaf5bf3e38d1c97fdd79a06a77fb02ef2b168c4c96d2e1ffbb878b1e9fc8d14aa59c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5ac1ba38cb180ee21bbe2e87f50f051ec3500953664a1ae81efea592ccb5f6aef34f16e1a9874d04a0e7d4ca4f8b005c04bc2f2ac90eb0709524b8d90031c619", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/17501bd4841cf8a3799b1f4bcc0ae8f6a91e3cf27be744a0491df73006499d947b00686f909b219a70668f34d5471bfbdb8d98ba2e7d317663b353fda50411c2"} 08:49:42 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:49:42 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:49:42 INFO - Contents: 08:49:42 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/48fdd4bc9e08440b23b3d548a66b7e993d068b19f6f17975b6de5e33ffbdbaf5bf3e38d1c97fdd79a06a77fb02ef2b168c4c96d2e1ffbb878b1e9fc8d14aa59c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5ac1ba38cb180ee21bbe2e87f50f051ec3500953664a1ae81efea592ccb5f6aef34f16e1a9874d04a0e7d4ca4f8b005c04bc2f2ac90eb0709524b8d90031c619", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/17501bd4841cf8a3799b1f4bcc0ae8f6a91e3cf27be744a0491df73006499d947b00686f909b219a70668f34d5471bfbdb8d98ba2e7d317663b353fda50411c2"} 08:49:42 INFO - Running post-run listener: copy_logs_to_upload_dir 08:49:42 INFO - Copying logs to upload dir... 08:49:42 INFO - mkdir: /builds/slave/test/build/upload/logs 08:49:42 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1271.370847 ========= master_lag: 0.06 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 11 secs) (at 2016-10-29 08:49:42.283857) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-29 08:49:42.287379) ========= 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.5gjUHbH12J/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.3J5rpcHLlB/Listeners TMPDIR=/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/48fdd4bc9e08440b23b3d548a66b7e993d068b19f6f17975b6de5e33ffbdbaf5bf3e38d1c97fdd79a06a77fb02ef2b168c4c96d2e1ffbb878b1e9fc8d14aa59c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5ac1ba38cb180ee21bbe2e87f50f051ec3500953664a1ae81efea592ccb5f6aef34f16e1a9874d04a0e7d4ca4f8b005c04bc2f2ac90eb0709524b8d90031c619", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/17501bd4841cf8a3799b1f4bcc0ae8f6a91e3cf27be744a0491df73006499d947b00686f909b219a70668f34d5471bfbdb8d98ba2e7d317663b353fda50411c2"} build_url:https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011075 build_url: 'https://queue.taskcluster.net/v1/task/NfebYEXnQbCcDMVgb1CZ7Q/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/48fdd4bc9e08440b23b3d548a66b7e993d068b19f6f17975b6de5e33ffbdbaf5bf3e38d1c97fdd79a06a77fb02ef2b168c4c96d2e1ffbb878b1e9fc8d14aa59c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5ac1ba38cb180ee21bbe2e87f50f051ec3500953664a1ae81efea592ccb5f6aef34f16e1a9874d04a0e7d4ca4f8b005c04bc2f2ac90eb0709524b8d90031c619", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/17501bd4841cf8a3799b1f4bcc0ae8f6a91e3cf27be744a0491df73006499d947b00686f909b219a70668f34d5471bfbdb8d98ba2e7d317663b353fda50411c2"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-29 08:49:42.320809) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 08:49:42.321149) ========= 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.5gjUHbH12J/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.3J5rpcHLlB/Listeners TMPDIR=/var/folders/y_/gkptfz8n2s9frngl8ywr38k000000w/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.005142 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 08:49:42.370892) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-29 08:49:42.371214) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-29 08:49:42.371549) ========= ========= Total master_lag: 3.11 =========