builder: mozilla-aurora_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0137 starttime: 1489331306.12 results: success (0) buildid: 20170312072936 builduid: 61f25951d46343a39ba7d3236d5a8a98 revision: d173b2b2852fde503b1e42875982ad023ab3ad8b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.118357) ========= master: http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.126289) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.126638) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.153803) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.154172) ========= 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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners TMPDIR=/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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 --2017-03-12 08:08: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% 76.4M=0s 2017-03-12 08:08:26 (76.4 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.642630 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.820612) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.820934) ========= 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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners TMPDIR=/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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.028115 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.870800) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:26.871167) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev d173b2b2852fde503b1e42875982ad023ab3ad8b --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 d173b2b2852fde503b1e42875982ad023ab3ad8b --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners TMPDIR=/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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 2017-03-12 08:08:26,973 truncating revision to first 12 chars 2017-03-12 08:08:26,973 Setting DEBUG logging. 2017-03-12 08:08:26,973 attempt 1/10 2017-03-12 08:08:26,973 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/d173b2b2852f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-12 08:08:27,512 unpacking tar archive at: mozilla-aurora-d173b2b2852f/testing/mozharness/ program finished with exit code 0 elapsedTime=0.810299 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:27.705159) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:27.705498) ========= script_repo_revision: d173b2b2852fde503b1e42875982ad023ab3ad8b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:27.705915) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:27.706190) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-12 08:08:27.726477) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 24 secs) (at 2017-03-12 08:08:27.726809) ========= /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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners TMPDIR=/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:08:27 INFO - MultiFileLogger online at 20170312 08:08:27 in /builds/slave/test 08:08:27 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:08:27 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:08:27 INFO - {'append_to_log': False, 08:08:27 INFO - 'base_work_dir': '/builds/slave/test', 08:08:27 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:08:27 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:08:27 INFO - 'branch': 'Mozilla-Aurora', 08:08:27 INFO - 'buildbot_json_path': 'buildprops.json', 08:08:27 INFO - 'config_files': ('talos/mac_config.py',), 08:08:27 INFO - 'default_actions': ('clobber', 08:08:27 INFO - 'read-buildbot-config', 08:08:27 INFO - 'download-and-extract', 08:08:27 INFO - 'populate-webroot', 08:08:27 INFO - 'create-virtualenv', 08:08:27 INFO - 'install', 08:08:27 INFO - 'run-tests'), 08:08:27 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:08:27 INFO - 'download_minidump_stackwalk': True, 08:08:27 INFO - 'download_symbols': 'ondemand', 08:08:27 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:08:27 INFO - 'tooltool.py': '/tools/tooltool.py', 08:08:27 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:08:27 INFO - '/tools/misc-python/virtualenv.py')}, 08:08:27 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:08:27 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:08:27 INFO - 'gecko_profile': False, 08:08:27 INFO - 'gecko_profile_interval': 0, 08:08:27 INFO - 'installer_path': 'installer.exe', 08:08:27 INFO - 'log_level': 'info', 08:08:27 INFO - 'log_name': 'talos', 08:08:27 INFO - 'log_to_console': True, 08:08:27 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 08:08:27 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 08:08:27 INFO - 'opt_config_files': (), 08:08:27 INFO - 'pip_index': False, 08:08:27 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:08:27 INFO - 'cmd': ('bash', 08:08:27 INFO - '-c', 08:08:27 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:08:27 INFO - 'enabled': True, 08:08:27 INFO - 'halt_on_failure': False, 08:08:27 INFO - 'name': 'check_screen_resolution'},), 08:08:27 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:08:27 INFO - 'cmd': ('bash', 08:08:27 INFO - '-c', 08:08:27 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:08:27 INFO - 'enabled': True, 08:08:27 INFO - 'halt_on_failure': False, 08:08:27 INFO - 'name': 'check_screen_resolution'},), 08:08:27 INFO - 'run_cmd_checks_enabled': True, 08:08:27 INFO - 'suite': 'dromaeojs', 08:08:27 INFO - 'system_bits': '32', 08:08:27 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:08:27 INFO - 'title': 't-yosemite-r7-0137', 08:08:27 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:08:27 INFO - 'use_talos_json': True, 08:08:27 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:08:27 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:08:27 INFO - 'work_dir': 'build'} 08:08:27 INFO - [mozharness: 2017-03-12 15:08:27.946295Z] Running clobber step. 08:08:27 INFO - Running pre-action listener: _resource_record_pre_action 08:08:27 INFO - Running main action method: clobber 08:08:27 INFO - rmtree: /builds/slave/test/build 08:08:27 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:08:30 INFO - Running post-action listener: _resource_record_post_action 08:08:30 INFO - [mozharness: 2017-03-12 15:08:30.393549Z] Finished clobber step (success) 08:08:30 INFO - [mozharness: 2017-03-12 15:08:30.393707Z] Running read-buildbot-config step. 08:08:30 INFO - Running pre-action listener: _resource_record_pre_action 08:08:30 INFO - Running main action method: read_buildbot_config 08:08:30 INFO - Using buildbot properties: 08:08:30 INFO - { 08:08:30 INFO - "project": "", 08:08:30 INFO - "product": "firefox", 08:08:30 INFO - "script_repo_revision": "production", 08:08:30 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs", 08:08:30 INFO - "repository": "", 08:08:30 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs", 08:08:30 INFO - "buildid": "20170312072936", 08:08:30 INFO - "pgo_build": "False", 08:08:30 INFO - "basedir": "/builds/slave/test", 08:08:30 INFO - "buildnumber": 13, 08:08:30 INFO - "slavename": "t-yosemite-r7-0137", 08:08:30 INFO - "master": "http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/", 08:08:30 INFO - "platform": "yosemite_r7", 08:08:30 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 08:08:30 INFO - "branch": "mozilla-aurora", 08:08:30 INFO - "repo_path": "releases/mozilla-aurora", 08:08:30 INFO - "revision": "d173b2b2852fde503b1e42875982ad023ab3ad8b", 08:08:30 INFO - "stage_platform": "macosx64", 08:08:30 INFO - "builduid": "61f25951d46343a39ba7d3236d5a8a98", 08:08:30 INFO - "slavebuilddir": "test" 08:08:30 INFO - } 08:08:30 INFO - Found installer url https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.dmg. 08:08:30 INFO - Running post-action listener: _resource_record_post_action 08:08:30 INFO - [mozharness: 2017-03-12 15:08:30.397055Z] Finished read-buildbot-config step (success) 08:08:30 INFO - [mozharness: 2017-03-12 15:08:30.397211Z] Running download-and-extract step. 08:08:30 INFO - Running pre-action listener: _resource_record_pre_action 08:08:30 INFO - Running main action method: download_and_extract 08:08:30 INFO - mkdir: /builds/slave/test/build/tests 08:08:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:08:30 INFO - trying https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.test_packages.json 08:08:30 INFO - Downloading https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-54.0a2.en-US.mac.test_packages.json 08:08:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-54.0a2.en-US.mac.test_packages.json'}, attempt #1 08:08:31 INFO - Downloaded 1199 bytes. 08:08:31 INFO - Reading from file /builds/slave/test/build/firefox-54.0a2.en-US.mac.test_packages.json 08:08:31 INFO - Using the following test package requirements: 08:08:31 INFO - {u'common': [u'firefox-54.0a2.en-US.mac.common.tests.zip'], 08:08:31 INFO - u'cppunittest': [u'firefox-54.0a2.en-US.mac.common.tests.zip', 08:08:31 INFO - u'firefox-54.0a2.en-US.mac.cppunittest.tests.zip'], 08:08:31 INFO - u'gtest': [u'firefox-54.0a2.en-US.mac.common.tests.zip', 08:08:31 INFO - u'firefox-54.0a2.en-US.mac.gtest.tests.zip'], 08:08:31 INFO - u'jittest': [u'firefox-54.0a2.en-US.mac.common.tests.zip', 08:08:31 INFO - u'jsshell-mac.zip'], 08:08:31 INFO - u'mochitest': [u'firefox-54.0a2.en-US.mac.common.tests.zip', 08:08:31 INFO - u'firefox-54.0a2.en-US.mac.mochitest.tests.zip'], 08:08:31 INFO - u'mozbase': [u'firefox-54.0a2.en-US.mac.common.tests.zip'], 08:08:31 INFO - u'reftest': [u'firefox-54.0a2.en-US.mac.common.tests.zip', 08:08:31 INFO - u'firefox-54.0a2.en-US.mac.reftest.tests.zip'], 08:08:31 INFO - u'talos': [u'firefox-54.0a2.en-US.mac.common.tests.zip', 08:08:31 INFO - u'firefox-54.0a2.en-US.mac.talos.tests.zip'], 08:08:31 INFO - u'web-platform': [u'firefox-54.0a2.en-US.mac.common.tests.zip', 08:08:31 INFO - u'firefox-54.0a2.en-US.mac.web-platform.tests.zip'], 08:08:31 INFO - u'xpcshell': [u'firefox-54.0a2.en-US.mac.common.tests.zip', 08:08:31 INFO - u'firefox-54.0a2.en-US.mac.xpcshell.tests.zip']} 08:08:31 INFO - Downloading packages: [u'firefox-54.0a2.en-US.mac.common.tests.zip'] for test suite category: common 08:08:31 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.common.tests.zip 08:08:31 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.common.tests.zip'}, attempt #1 08:08:31 INFO - Fetch https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.common.tests.zip into memory 08:08:33 INFO - Expected file size: 51779041 08:08:33 INFO - Obtained file size: 51779041 08:08:49 INFO - Downloading packages: [u'firefox-54.0a2.en-US.mac.common.tests.zip', u'firefox-54.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 08:08:49 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.common.tests.zip 08:08:49 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.common.tests.zip'}, attempt #1 08:08:49 INFO - Fetch https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.common.tests.zip into memory 08:08:51 INFO - Expected file size: 51779041 08:08:51 INFO - Obtained file size: 51779041 08:09:06 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.talos.tests.zip 08:09:06 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.talos.tests.zip'}, attempt #1 08:09:06 INFO - Fetch https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.talos.tests.zip into memory 08:09:08 INFO - Expected file size: 14404424 08:09:08 INFO - Obtained file size: 14404424 08:09:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:08 INFO - trying https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.dmg 08:09:08 INFO - Downloading https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-54.0a2.en-US.mac.dmg 08:09:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-54.0a2.en-US.mac.dmg'}, attempt #1 08:09:10 INFO - Downloaded 74620497 bytes. 08:09:10 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.dmg 08:09:10 INFO - mkdir: /builds/slave/test/properties 08:09:10 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:09:10 INFO - Writing to file /builds/slave/test/properties/build_url 08:09:10 INFO - Contents: 08:09:10 INFO - build_url:https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.dmg 08:09:11 INFO - Running post-action listener: _resource_record_post_action 08:09:11 INFO - Running post-action listener: set_extra_try_arguments 08:09:11 INFO - [mozharness: 2017-03-12 15:09:11.278264Z] Finished download-and-extract step (success) 08:09:11 INFO - [mozharness: 2017-03-12 15:09:11.278417Z] Running populate-webroot step. 08:09:11 INFO - Running pre-action listener: _resource_record_pre_action 08:09:11 INFO - Running main action method: populate_webroot 08:09:11 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:09:11 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:09:11 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:09:11 INFO - '--tppagecycles', 08:09:11 INFO - '7'], 08:09:11 INFO - 'tests': ['tsvgm']}}, 08:09:11 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:09:11 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:09:11 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:09:11 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:09:11 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 08:09:11 INFO - 'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:09:11 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:09:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:09:11 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 08:09:11 INFO - 'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['damp', 'tps']}, 08:09:11 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:09:11 INFO - 'tests': ['damp', 'tps']}, 08:09:11 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['dromaeo_dom']}, 08:09:11 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:09:11 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['basic_compositor_video']}, 08:09:11 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:09:11 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['a11yr', 08:09:11 INFO - 'ts_paint', 08:09:11 INFO - 'tpaint', 08:09:11 INFO - 'sessionrestore', 08:09:11 INFO - 'sessionrestore_no_auto_restore', 08:09:11 INFO - 'tabpaint']}, 08:09:11 INFO - 'other-e10s': {'tests': ['a11yr', 08:09:11 INFO - 'ts_paint', 08:09:11 INFO - 'tpaint', 08:09:11 INFO - 'sessionrestore', 08:09:11 INFO - 'sessionrestore_no_auto_restore', 08:09:11 INFO - 'tabpaint']}, 08:09:11 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:09:11 INFO - 'ts_paint', 08:09:11 INFO - 'tpaint', 08:09:11 INFO - 'sessionrestore', 08:09:11 INFO - 'sessionrestore_no_auto_restore', 08:09:11 INFO - 'tabpaint']}, 08:09:11 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:09:11 INFO - 'ts_paint', 08:09:11 INFO - 'tpaint', 08:09:11 INFO - 'sessionrestore', 08:09:11 INFO - 'sessionrestore_no_auto_restore', 08:09:11 INFO - 'tabpaint']}, 08:09:11 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['a11yr', 08:09:11 INFO - 'ts_paint', 08:09:11 INFO - 'tpaint', 08:09:11 INFO - 'sessionrestore', 08:09:11 INFO - 'sessionrestore_no_auto_restore', 08:09:11 INFO - 'tabpaint']}, 08:09:11 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['a11yr', 08:09:11 INFO - 'ts_paint', 08:09:11 INFO - 'tpaint', 08:09:11 INFO - 'sessionrestore', 08:09:11 INFO - 'sessionrestore_no_auto_restore', 08:09:11 INFO - 'tabpaint']}, 08:09:11 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['tsvgx', 08:09:11 INFO - 'tsvgr_opacity', 08:09:11 INFO - 'tart', 08:09:11 INFO - 'tscrollx', 08:09:11 INFO - 'cart', 08:09:11 INFO - 'tsvg_static']}, 08:09:11 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:09:11 INFO - 'tsvgr_opacity', 08:09:11 INFO - 'tart', 08:09:11 INFO - 'tscrollx', 08:09:11 INFO - 'cart', 08:09:11 INFO - 'tsvg_static']}, 08:09:11 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 08:09:11 INFO - 'talos_options': ['--disable-e10s'], 08:09:11 INFO - 'tests': ['tp5o']}, 08:09:11 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:09:11 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 08:09:11 INFO - 'talos_options': ['--disable-e10s', 08:09:11 INFO - '--xperf_path', 08:09:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:09:11 INFO - 'tests': ['tp5n']}, 08:09:11 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:09:11 INFO - 'talos_options': ['--xperf_path', 08:09:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:09:11 INFO - 'tests': ['tp5n']}}, 08:09:11 INFO - 'talos.zip': {'path': '', 08:09:11 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:09:11 INFO - Running post-action listener: _resource_record_post_action 08:09:11 INFO - [mozharness: 2017-03-12 15:09:11.296720Z] Finished populate-webroot step (success) 08:09:11 INFO - [mozharness: 2017-03-12 15:09:11.296836Z] Running create-virtualenv step. 08:09:11 INFO - Running pre-action listener: _resource_record_pre_action 08:09:11 INFO - Running main action method: create_virtualenv 08:09:11 INFO - Creating virtualenv /builds/slave/test/build/venv 08:09:11 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:09:11 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:09:11 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:09:11 INFO - Using real prefix '/tools/python27' 08:09:11 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:09:12 INFO - Installing distribute.............................................................................................................................................................................................done. 08:09:15 INFO - Installing pip.................done. 08:09:15 INFO - Return code: 0 08:09:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:09:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:09:15 INFO - Reading from file tmpfile_stdout 08:09:15 INFO - Output received: 08:09:15 INFO - pip 1.5.5 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 08:09:15 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:09: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:09:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09: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:09:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:15 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 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:15 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:09:15 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:09:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:15 INFO - 'HOME': '/Users/cltbld', 08:09:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:15 INFO - 'LOGNAME': 'cltbld', 08:09:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:15 INFO - 'MOZ_NO_REMOTE': '1', 08:09:15 INFO - 'NO_EM_RESTART': '1', 08:09:15 INFO - 'PAGER': '/bin/cat', 08:09:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:15 INFO - 'PWD': '/builds/slave/test', 08:09:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:15 INFO - 'SHELL': '/bin/bash', 08:09:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:15 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:15 INFO - 'USER': 'cltbld', 08:09:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:15 INFO - 'XPC_FLAGS': '0x0', 08:09:15 INFO - 'XPC_SERVICE_NAME': '0', 08:09:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:15 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:09:15 INFO - Cleaning up... 08:09:15 INFO - Return code: 0 08:09:15 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:09: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:09:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09: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:09:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:15 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 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:15 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:09:15 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:09:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:15 INFO - 'HOME': '/Users/cltbld', 08:09:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:15 INFO - 'LOGNAME': 'cltbld', 08:09:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:15 INFO - 'MOZ_NO_REMOTE': '1', 08:09:15 INFO - 'NO_EM_RESTART': '1', 08:09:15 INFO - 'PAGER': '/bin/cat', 08:09:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:15 INFO - 'PWD': '/builds/slave/test', 08:09:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:15 INFO - 'SHELL': '/bin/bash', 08:09:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:15 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:15 INFO - 'USER': 'cltbld', 08:09:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:15 INFO - 'XPC_FLAGS': '0x0', 08:09:15 INFO - 'XPC_SERVICE_NAME': '0', 08:09:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:15 INFO - Downloading/unpacking psutil>=3.1.1 08:09:15 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:09:15 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:09:15 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:09:15 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:09:15 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:09:15 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:09:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:09:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:09:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:09:20 INFO - Installing collected packages: psutil 08:09:20 INFO - Running setup.py install for psutil 08:09:20 INFO - building 'psutil._psutil_osx' extension 08:09:20 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:09:20 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:09:20 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:09:20 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:09:20 INFO - building 'psutil._psutil_posix' extension 08:09:20 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:09:20 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 08:09:20 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 08:09:20 INFO - ^ 08:09:21 INFO - 1 warning generated. 08:09:21 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:09:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:09:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:09:21 INFO - Successfully installed psutil 08:09:21 INFO - Cleaning up... 08:09:21 INFO - Return code: 0 08:09:21 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:09:21 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:09:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:21 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:09:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:21 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 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:21 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:09:21 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:09:21 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:21 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:21 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:21 INFO - 'HOME': '/Users/cltbld', 08:09:21 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:21 INFO - 'LOGNAME': 'cltbld', 08:09:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:21 INFO - 'MOZ_NO_REMOTE': '1', 08:09:21 INFO - 'NO_EM_RESTART': '1', 08:09:21 INFO - 'PAGER': '/bin/cat', 08:09:21 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:21 INFO - 'PWD': '/builds/slave/test', 08:09:21 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:21 INFO - 'SHELL': '/bin/bash', 08:09:21 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:21 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:21 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:21 INFO - 'USER': 'cltbld', 08:09:21 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:21 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:21 INFO - 'XPC_FLAGS': '0x0', 08:09:21 INFO - 'XPC_SERVICE_NAME': '0', 08:09:21 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:21 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:09: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:09: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:09: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:09: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:09: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:09: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:09:24 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:09:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:09:24 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:09:24 INFO - Installing collected packages: mozsystemmonitor 08:09:24 INFO - Running setup.py install for mozsystemmonitor 08:09:24 INFO - Successfully installed mozsystemmonitor 08:09:24 INFO - Cleaning up... 08:09:24 INFO - Return code: 0 08:09:24 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:09:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:24 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 08:09:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 08:09:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:24 INFO - 'HOME': '/Users/cltbld', 08:09:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:24 INFO - 'LOGNAME': 'cltbld', 08:09:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:24 INFO - 'MOZ_NO_REMOTE': '1', 08:09:24 INFO - 'NO_EM_RESTART': '1', 08:09:24 INFO - 'PAGER': '/bin/cat', 08:09:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:24 INFO - 'PWD': '/builds/slave/test', 08:09:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:24 INFO - 'SHELL': '/bin/bash', 08:09:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:24 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:24 INFO - 'USER': 'cltbld', 08:09:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:24 INFO - 'XPC_FLAGS': '0x0', 08:09:24 INFO - 'XPC_SERVICE_NAME': '0', 08:09:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:24 INFO - Downloading/unpacking jsonschema==2.5.1 08:09:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:27 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:09:27 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:09:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:27 INFO - Downloading functools32-3.2.3-2.tar.gz 08:09:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:09:27 INFO - warning: no files found matching '*.txt' 08:09:27 INFO - no previously-included directories found matching 'build' 08:09:27 INFO - no previously-included directories found matching 'dist' 08:09:27 INFO - no previously-included directories found matching '.git*' 08:09:27 INFO - Installing collected packages: jsonschema, functools32 08:09:27 INFO - Running setup.py install for functools32 08:09:28 INFO - warning: no files found matching '*.txt' 08:09:28 INFO - no previously-included directories found matching 'build' 08:09:28 INFO - no previously-included directories found matching 'dist' 08:09:28 INFO - no previously-included directories found matching '.git*' 08:09:28 INFO - Successfully installed jsonschema functools32 08:09:28 INFO - Cleaning up... 08:09:28 INFO - Return code: 0 08:09:28 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:09:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 08:09:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 08:09:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:28 INFO - 'HOME': '/Users/cltbld', 08:09:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:28 INFO - 'LOGNAME': 'cltbld', 08:09:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:28 INFO - 'MOZ_NO_REMOTE': '1', 08:09:28 INFO - 'NO_EM_RESTART': '1', 08:09:28 INFO - 'PAGER': '/bin/cat', 08:09:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:28 INFO - 'PWD': '/builds/slave/test', 08:09:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:28 INFO - 'SHELL': '/bin/bash', 08:09:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:28 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:28 INFO - 'USER': 'cltbld', 08:09:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:28 INFO - 'XPC_FLAGS': '0x0', 08:09:28 INFO - 'XPC_SERVICE_NAME': '0', 08:09:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:28 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:09:28 INFO - Cleaning up... 08:09:28 INFO - Return code: 0 08:09:28 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:09:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:09:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:09:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:28 INFO - 'HOME': '/Users/cltbld', 08:09:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:28 INFO - 'LOGNAME': 'cltbld', 08:09:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:28 INFO - 'MOZ_NO_REMOTE': '1', 08:09:28 INFO - 'NO_EM_RESTART': '1', 08:09:28 INFO - 'PAGER': '/bin/cat', 08:09:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:28 INFO - 'PWD': '/builds/slave/test', 08:09:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:28 INFO - 'SHELL': '/bin/bash', 08:09:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:28 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:28 INFO - 'USER': 'cltbld', 08:09:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:28 INFO - 'XPC_FLAGS': '0x0', 08:09:28 INFO - 'XPC_SERVICE_NAME': '0', 08:09:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:28 INFO - Downloading/unpacking blobuploader==1.2.4 08:09:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:31 INFO - Downloading blobuploader-1.2.4.tar.gz 08:09:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:09:31 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:09:31 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:09:31 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:09:31 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:09:31 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:09:31 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:09:31 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:09:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:09:32 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:09:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:32 INFO - Downloading docopt-0.6.1.tar.gz 08:09:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:09:32 INFO - Installing collected packages: blobuploader, requests, docopt 08:09:32 INFO - Running setup.py install for blobuploader 08:09:32 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:09:32 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:09:32 INFO - Running setup.py install for requests 08:09:33 INFO - Running setup.py install for docopt 08:09:33 INFO - Successfully installed blobuploader requests docopt 08:09:33 INFO - Cleaning up... 08:09:33 INFO - Return code: 0 08:09:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:09: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:09:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09: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:09:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:33 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 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:33 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:09:33 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:09:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:33 INFO - 'HOME': '/Users/cltbld', 08:09:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:33 INFO - 'LOGNAME': 'cltbld', 08:09:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:33 INFO - 'MOZ_NO_REMOTE': '1', 08:09:33 INFO - 'NO_EM_RESTART': '1', 08:09:33 INFO - 'PAGER': '/bin/cat', 08:09:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:33 INFO - 'PWD': '/builds/slave/test', 08:09:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:33 INFO - 'SHELL': '/bin/bash', 08:09:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:33 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:33 INFO - 'USER': 'cltbld', 08:09:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:33 INFO - 'XPC_FLAGS': '0x0', 08:09:33 INFO - 'XPC_SERVICE_NAME': '0', 08:09:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:09:33 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-Y6ypMx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:09:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:09:33 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-pUCX4q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-hZF6K1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-cDsTcj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-WgrRiN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-NLMHlf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-YMyzu1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-EFaJbr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-mhjQ1R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-RpKwQf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:09:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:09:34 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-v77cva-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:09:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:09:35 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-P2s77H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:09:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:09:35 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-uJ0d0a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:09:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:09:35 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-XLoV2v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:09:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:09:35 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-xts_8q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:09:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:09:35 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-iYFbzZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:09:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:09:35 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-5lMgBn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:09:35 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:09:35 INFO - Running setup.py install for manifestparser 08:09:35 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:09:35 INFO - Running setup.py install for mozcrash 08:09:35 INFO - Running setup.py install for mozdebug 08:09:36 INFO - Running setup.py install for mozdevice 08:09:36 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:09:36 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:09:36 INFO - Running setup.py install for mozfile 08:09:36 INFO - Running setup.py install for mozhttpd 08:09:36 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:09:36 INFO - Running setup.py install for mozinfo 08:09:36 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:09:36 INFO - Running setup.py install for mozInstall 08:09:36 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:09:36 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:09:36 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:09:36 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:09:36 INFO - Running setup.py install for mozleak 08:09:36 INFO - Running setup.py install for mozlog 08:09:37 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:09:37 INFO - Running setup.py install for moznetwork 08:09:37 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:09:37 INFO - Running setup.py install for mozprocess 08:09:37 INFO - Running setup.py install for mozprofile 08:09:37 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:09:37 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:09:37 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:09:37 INFO - Running setup.py install for mozrunner 08:09:37 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:09:37 INFO - Running setup.py install for mozscreenshot 08:09:37 INFO - Running setup.py install for moztest 08:09:38 INFO - Running setup.py install for mozversion 08:09:38 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:09:38 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:09:38 INFO - Cleaning up... 08:09:38 INFO - Return code: 0 08:09:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:09:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:38 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 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:38 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:09:38 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:09:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:38 INFO - 'HOME': '/Users/cltbld', 08:09:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:38 INFO - 'LOGNAME': 'cltbld', 08:09:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:38 INFO - 'MOZ_NO_REMOTE': '1', 08:09:38 INFO - 'NO_EM_RESTART': '1', 08:09:38 INFO - 'PAGER': '/bin/cat', 08:09:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:38 INFO - 'PWD': '/builds/slave/test', 08:09:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:38 INFO - 'SHELL': '/bin/bash', 08:09:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:38 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:38 INFO - 'USER': 'cltbld', 08:09:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:38 INFO - 'XPC_FLAGS': '0x0', 08:09:38 INFO - 'XPC_SERVICE_NAME': '0', 08:09:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:09:38 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-SyAkdX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:09:38 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:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:09:38 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-kd66RP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:09:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:09:38 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-iTSM1d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:09:38 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:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:09:38 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-NsPi5P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:09:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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:09:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:09:38 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-G2ZpKT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:09:39 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-9oX6yn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:09:39 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-IoSTj9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:09:39 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-kPNQIQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:09:39 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-QJVDNn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:09:39 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-1pSmao-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:09:39 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-M6LV0G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:09:39 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-NyBvdY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:09:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-z9vXlk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:09:39 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:09:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:09:39 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-H7TXcG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:09:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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:09:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:09:40 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-hpmAC2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:09:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:09:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:09:40 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-cCGMNT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:09:40 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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:09:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:09:40 INFO - Running setup.py (path:/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/pip-077Fsi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:09:40 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:09:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:09:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:09:40 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:09:40 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:09:40 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:09:40 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:09:40 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:09:40 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:09:40 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:09:40 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:09:40 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:09:40 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:09:42 INFO - Downloading blessings-1.6.tar.gz 08:09:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:09:43 INFO - Installing collected packages: blessings 08:09:43 INFO - Running setup.py install for blessings 08:09:43 INFO - Successfully installed blessings 08:09:43 INFO - Cleaning up... 08:09:43 INFO - Return code: 0 08:09:43 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:09:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:09:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:09:43 INFO - Reading from file tmpfile_stdout 08:09:43 INFO - Current package versions: 08:09:43 INFO - blessings == 1.6 08:09:43 INFO - blobuploader == 1.2.4 08:09:43 INFO - docopt == 0.6.1 08:09:43 INFO - functools32 == 3.2.3-2 08:09:43 INFO - jsonschema == 2.5.1 08:09:43 INFO - manifestparser == 1.1 08:09:43 INFO - mozInstall == 1.12 08:09:43 INFO - mozcrash == 1.0 08:09:43 INFO - mozdebug == 0.1 08:09:43 INFO - mozdevice == 0.49 08:09:43 INFO - mozfile == 1.2 08:09:43 INFO - mozhttpd == 0.7 08:09:43 INFO - mozinfo == 0.9 08:09:43 INFO - mozleak == 0.1 08:09:43 INFO - mozlog == 3.4 08:09:43 INFO - moznetwork == 0.27 08:09:43 INFO - mozprocess == 0.25 08:09:43 INFO - mozprofile == 0.28 08:09:43 INFO - mozrunner == 6.13 08:09:43 INFO - mozscreenshot == 0.1 08:09:43 INFO - mozsystemmonitor == 0.3 08:09:43 INFO - moztest == 0.8 08:09:43 INFO - mozversion == 1.4 08:09:43 INFO - psutil == 3.1.1 08:09:43 INFO - requests == 1.2.3 08:09:43 INFO - wsgiref == 0.1.2 08:09:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:09:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 08:09:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:09:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:43 INFO - 'HOME': '/Users/cltbld', 08:09:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:43 INFO - 'LOGNAME': 'cltbld', 08:09:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:43 INFO - 'MOZ_NO_REMOTE': '1', 08:09:43 INFO - 'NO_EM_RESTART': '1', 08:09:43 INFO - 'PAGER': '/bin/cat', 08:09:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:43 INFO - 'PWD': '/builds/slave/test', 08:09:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:43 INFO - 'SHELL': '/bin/bash', 08:09:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:43 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:43 INFO - 'USER': 'cltbld', 08:09:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:43 INFO - 'XPC_FLAGS': '0x0', 08:09:43 INFO - 'XPC_SERVICE_NAME': '0', 08:09:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:09:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:09:43 INFO - Cleaning up... 08:09:43 INFO - Return code: 0 08:09:43 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:09:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:09:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107f03b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107f06768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe1594b3f40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, '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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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:09:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 08:09:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 08:09:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:09:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:09:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:09:43 INFO - 'HOME': '/Users/cltbld', 08:09:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:09:43 INFO - 'LOGNAME': 'cltbld', 08:09:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:43 INFO - 'MOZ_NO_REMOTE': '1', 08:09:43 INFO - 'NO_EM_RESTART': '1', 08:09:43 INFO - 'PAGER': '/bin/cat', 08:09:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:09:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:09:43 INFO - 'PWD': '/builds/slave/test', 08:09:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:09:43 INFO - 'SHELL': '/bin/bash', 08:09:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:09:43 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:09:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:09:43 INFO - 'USER': 'cltbld', 08:09:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:09:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:09:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:43 INFO - 'XPC_FLAGS': '0x0', 08:09:43 INFO - 'XPC_SERVICE_NAME': '0', 08:09:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:09:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:44 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:09:44 INFO - Cleaning up... 08:09:44 INFO - Return code: 0 08:09:44 INFO - Running post-action listener: _resource_record_post_action 08:09:44 INFO - Running post-action listener: _start_resource_monitoring 08:09:44 INFO - Starting resource monitoring. 08:09:44 INFO - [mozharness: 2017-03-12 15:09:44.209593Z] Finished create-virtualenv step (success) 08:09:44 INFO - [mozharness: 2017-03-12 15:09:44.210591Z] Running install step. 08:09:44 INFO - Running pre-action listener: _resource_record_pre_action 08:09:44 INFO - Running main action method: install 08:09:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:09:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:09:44 INFO - Reading from file tmpfile_stdout 08:09:44 INFO - Detecting whether we're running mozinstall >=1.0... 08:09:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:09:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:09:44 INFO - Reading from file tmpfile_stdout 08:09:44 INFO - Output received: 08:09:44 INFO - Usage: mozinstall [options] installer 08:09:44 INFO - Options: 08:09:44 INFO - -h, --help show this help message and exit 08:09:44 INFO - -d DEST, --destination=DEST 08:09:44 INFO - Directory to install application into. [default: 08:09:44 INFO - "/builds/slave/test"] 08:09:44 INFO - --app=APP Application being installed. [default: firefox] 08:09:44 INFO - mkdir: /builds/slave/test/build/application 08:09:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-54.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 08:09:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-54.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 08:10:04 INFO - Reading from file tmpfile_stdout 08:10:04 INFO - Output received: 08:10:04 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 08:10:04 INFO - Running post-action listener: _resource_record_post_action 08:10:04 INFO - [mozharness: 2017-03-12 15:10:04.580274Z] Finished install step (success) 08:10:04 INFO - [mozharness: 2017-03-12 15:10:04.580426Z] Running run-tests step. 08:10:04 INFO - Running pre-action listener: _resource_record_pre_action 08:10:04 INFO - Running main action method: run_tests 08:10:04 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:10:04 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:10:04 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:10:04 INFO - 2017-03-12 08:10:04.595 screenresolution[1647:15223] starting screenresolution argv=screenresolution get 08:10:04 INFO - 2017-03-12 08:10:04.598 screenresolution[1647:15223] Display 0: 1600x1200x32@60 08:10:04 INFO - 2017-03-12 08:10:04.604 screenresolution[1648:15226] starting screenresolution argv=screenresolution list 08:10:04 INFO - Available Modes on Display 0 08:10:04 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:10:04 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:10:04 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:10:04 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:10:04 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:10:04 INFO - Intel Iris: 08:10:04 INFO - Chipset Model: Intel Iris 08:10:04 INFO - Type: GPU 08:10:04 INFO - Bus: Built-In 08:10:04 INFO - VRAM (Dynamic, Max): 1536 MB 08:10:04 INFO - Vendor: Intel (0x8086) 08:10:04 INFO - Device ID: 0x0a2e 08:10:04 INFO - Revision ID: 0x0009 08:10:04 INFO - Displays: 08:10:04 INFO - Display: 08:10:04 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:10:04 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:10:04 INFO - Display Serial Number: 1600x1200 60 08:10:04 INFO - Main Display: Yes 08:10:04 INFO - Mirror: Off 08:10:04 INFO - Online: Yes 08:10:04 INFO - Rotation: Supported 08:10:04 INFO - Return code: 0 08:10:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:10:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:10:04 INFO - Python 2.7.3 08:10:04 INFO - Return code: 0 08:10:04 INFO - grabbing minidump binary from tooltool 08:10:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:10:04 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/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 0x107ce1d30>, '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 0x107c08db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107cd6be8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:10:04 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 08:10:04 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 08:10:04 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 08:10:04 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:10:04 INFO - Return code: 0 08:10:04 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 08:10:04 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:10:04 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:10:04 INFO - ENV: RUST_BACKTRACE is now 1 08:10:04 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 08:10:04 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:10:04 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/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0137', '--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:10:04 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/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0137 --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:10:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.q4fAJ0MhsB/Render', 08:10:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:10:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:10:04 INFO - 'HOME': '/Users/cltbld', 08:10:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:10:04 INFO - 'LOGNAME': 'cltbld', 08:10:04 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:10:04 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 08:10:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:10:04 INFO - 'MOZ_NO_REMOTE': '1', 08:10:04 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:10:04 INFO - 'NO_EM_RESTART': '1', 08:10:04 INFO - 'PAGER': '/bin/cat', 08:10:04 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:10:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:10:04 INFO - 'PWD': '/builds/slave/test', 08:10:04 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:10:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:10:04 INFO - 'RUST_BACKTRACE': '1', 08:10:04 INFO - 'SHELL': '/bin/bash', 08:10:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.xgB4D2OI1t/Listeners', 08:10:04 INFO - 'TMPDIR': '/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/', 08:10:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:10:04 INFO - 'USER': 'cltbld', 08:10:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:10:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:10:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:10:04 INFO - 'XPC_FLAGS': '0x0', 08:10:04 INFO - 'XPC_SERVICE_NAME': '0', 08:10:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:10:04 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/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0137', '--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:10:05 INFO - mozversion application_buildid: 20170312072936 08:10:05 INFO - mozversion application_changeset: d173b2b2852fde503b1e42875982ad023ab3ad8b 08:10:05 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:10:05 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:10:05 INFO - mozversion application_name: Firefox 08:10:05 INFO - mozversion application_remotingname: firefox-dev 08:10:05 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:10:05 INFO - mozversion application_vendor: Mozilla 08:10:05 INFO - mozversion application_version: 54.0a2 08:10:05 INFO - mozversion platform_buildid: 20170312072936 08:10:05 INFO - mozversion platform_changeset: d173b2b2852fde503b1e42875982ad023ab3ad8b 08:10:05 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:10:05 INFO - mozversion platform_version: 54.0a2 08:10:05 INFO - using testdate: 1489331405 08:10:05 INFO - actual date: 1489331405 08:10:05 INFO - starting webserver on 'localhost:49250' 08:10:05 INFO - SUITE-START | Running 2 tests 08:10:05 INFO - TEST-START | dromaeo_css 08:10:05 INFO - operating with platform_type : mac_ 08:10:05 INFO - Initialising browser for dromaeo_css test... 08:10:05 INFO - TEST-INFO | started process 1658 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/tmpfMElEr/profile http://localhost:49250/getInfo.html) 08:10:07 INFO - PROCESS | 1658 | __metrics Screen width/height:1600/1200 08:10:07 INFO - PROCESS | 1658 | colorDepth:24 08:10:07 INFO - PROCESS | 1658 | Browser inner width/height: 1024/689 08:10:07 INFO - PROCESS | 1658 | __metrics 08:10:07 INFO - PROCESS | 1658 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:10:07 INFO - PROCESS | 1658 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:10:08 INFO - TEST-INFO | 1658: exit 0 08:10:08 INFO - Browser initialized. 08:10:08 INFO - Running cycle 1/1 for dromaeo_css test... 08:10:08 INFO - TEST-INFO | started process 1661 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/tmpfMElEr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:10:20 INFO - PROCESS | 1661 | RSS: Main: 210419712 08:10:20 INFO - PROCESS | 1661 | 08:13:25 INFO - PROCESS | 1661 | Cycle 1(1): loaded http://localhost:49250/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49250/tests/dromaeo/cssquery-ext.html) 08:13:27 INFO - PROCESS | 1661 | RSS: Main: 419913728 08:13:27 INFO - PROCESS | 1661 | 08:15:10 INFO - PROCESS | 1661 | ************************* 08:15:10 INFO - PROCESS | 1661 | A coding exception was thrown and uncaught in a Task. 08:15:10 INFO - PROCESS | 1661 | 08:15:10 ERROR - PROCESS | 1661 | Full message: TypeError: NetworkError when attempting to fetch resource. 08:15:10 INFO - PROCESS | 1661 | Full stack: 08:15:10 INFO - PROCESS | 1661 | ************************* 08:16:30 INFO - PROCESS | 1661 | Cycle 1(1): loaded http://localhost:49250/tests/dromaeo/cssquery-ext.html (next: http://localhost:49250/tests/dromaeo/cssquery-jquery.html) 08:16:31 INFO - PROCESS | 1661 | RSS: Main: 352276480 08:16:31 INFO - PROCESS | 1661 | 08:19:34 INFO - PROCESS | 1661 | Cycle 1(1): loaded http://localhost:49250/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49250/tests/dromaeo/cssquery-mootools.html) 08:19:34 INFO - PROCESS | 1661 | RSS: Main: 340254720 08:19:34 INFO - PROCESS | 1661 | 08:22:36 INFO - PROCESS | 1661 | Cycle 1(1): loaded http://localhost:49250/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49250/tests/dromaeo/cssquery-prototype.html) 08:22:37 INFO - PROCESS | 1661 | RSS: Main: 323633152 08:22:37 INFO - PROCESS | 1661 | 08:25:41 INFO - PROCESS | 1661 | Cycle 1(1): loaded http://localhost:49250/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49250/tests/dromaeo/cssquery-yui.html) 08:25:42 INFO - PROCESS | 1661 | RSS: Main: 329940992 08:25:42 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | Cycle 1(1): loaded http://localhost:49250/tests/dromaeo/cssquery-yui.html (next: http://localhost:49250/tests/dromaeo/cssquery-dojo.html) 08:28:45 INFO - PROCESS | 1661 | RSS: Main: 453136384 08:28:45 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | __start_tp_report 08:28:45 INFO - PROCESS | 1661 | _x_x_mozilla_page_load 08:28:45 INFO - PROCESS | 1661 | _x_x_mozilla_page_load_details 08:28:45 INFO - PROCESS | 1661 | |i|pagename|runs| 08:28:45 INFO - PROCESS | 1661 | |0;dojo.html;3393.67760062794;3420.469827176787;3452.6374730653297;3485.041613556272;3489.180042689968;6000.279966404027;6027.095935609661;6040.30536488304;6053.757849686007;6060.090986352044;6029.457348838604;6101.6033957792715;6104.481119104881;6115.388461153882;6125.9387406125925;5425.996190704723;5448.700321482317;5489.615726899118;5491.862703432406;5572.637778544382;5356.812511562096;5358.732063396815;5401.4868587484125;5532.889342213153;5586.55307575393;5432.75552600134;5462.617616766828;5464.453554644543;5465.617406781527;5468.7539060742365;5434.402215756264;5461.15352120422;5462.590305727047;5467.988422141897;5472.945270547283;5277.604179686539;5392;5405.540529055035;5410.188471729232;5424.945750542483;5095.847124586268;6070.635761854259;6079.361667024988;6088.4215999479975;6092.603980741238;6218.844528886769;6228.87542249157;6242.063690446424;6250.624962502219;6250.843728906768;6297.338779428185;6299.65351905645;6305.4009869062365;6448.903266451007;6457.0637257597855;6094;6143.78496752616;6149.354317796657;6153.969230153865;6154.415330543591;6376.330485298977;6667.933320666732;6671.232808227019;6672.466202703772;6675.632840193787;6168.167297414881;6267.7806276781;6278;6294.590851594632;6303;6320.209973753281;6426.3573642635365;6441.774537891151;6467.417932386108;6525.086487891699;6399.840003999937;6401.263854656681;6408.807735767934;6416.069669897839;6416.839579010562;6425.903611445832;6429.6463694496315;6434.388733070351;6434.613923164531;6458.483321334282;5071.695698258042;5116.513931176532;5155.200943853709;5156.664816786897;5169.431362550116;4617.699849509839;4622.6301895848255;4624.12141693084;4632.490426053131;4634.397528321297;5901.0558310670085;5934.109883517421;5935.881282374415;5945.256842894638;5950.375210602911;5130.4105846340235;6239.251289845248;6254.874902501924;6370.0763389308295;6390.45681117101;6068.302145253264;6073.453389194905;6075.696215189223;6096.634201947809;6099.634021958696;5694.402087780723;5696;5710.885782284331;5724.942750572524;5724.942750572524;6430.260520040161;6448.903266451007;6521.4130728232785;6545.70544325516;6548.705308261045;6319.273283572448;6326.367363263636;6330.082138090043;6346.936530634819;6426.839329016812;6668.899966500409;6687.732490700512;6693.832654183684;6695.698693558899;6695.698693558899;6382.808515744535;6382.840428989312;6388.488920886225;6399.328070552525;6415.647139407378;6264.624122552661;6266.122742816101;6474.935250647433;6479.157709497924;6479.287278399278;6151.5386346025125;6224;6248.4688801452385;6251.093591429309;6254.030625253093;6193.81418557444;6224.097505861715;6291.842703932438;6319.96840015797;6332.208473940757;6210.285817131088;6219.968900155471;6233.812985610439;6241.563090583615;6253.906191407224;6157.6613286269685;6191.288001879841;6290.0879372491645;6293.716782744696;6305.306416294296;6146.323904370426;6158.538109641884;6198.535109866868;6218.19163508741;6229.906551401823 08:28:45 INFO - PROCESS | 1661 | |1;ext.html;784.7371130671224;818.0878320672452;871.952042637655;893.3166127912144;896.0099090504996;39123.41314880279;39413.408798868004;39464.01339966506;39541.406878896836;41944.58055419445;40808;41139.58860411395;41141.794291028506;41145.38281925766;41456;7314.963425182893;7483.962580187119;9085.863712044307;9282.814343713122;9290.489023103726;7380.557166569996;7470.1035875695;7513.549187048795;8877.733667989938;11122.943320384551;11101.611443599435;11138.220324577283;11183.49674264656;11192.272502287366;11211.439428028607;11117.610883619116;11132.220744547885;11156.274842135235;11160.720981975515;11161.609343672932;10889.183311251687;10935.961083697037;10939.83590246147;10940.945295273552;10967.780644387067;39450.80274598637;39500.01249968745;39615.60384396148;39770.801145994374;39909;3788.5643151037434;3816.6183381661613;3849.3456112460667;3903.6486716195395;3923.3526468132723;27483;29179.708202918122;29265.56101658477;29387.118386448226;29430.558541621893;2288.187693368847;2764.903228387017;3012.548117782328;3091.0726781965323;3092.087834088949;242328;266920;269119;354867;356114;42968.78515607402;52462;52620.473795262325;52658.473415266126;52720;54528.45471545313;54566;54914.725426373414;54916.72541637266;54936.45063549393;14726.558203253919;14805.629859253604;14819.481318153812;14837;14840.703185936221;12570.308633025088;12573.119881608383;12587.622371328875;12599.055070869537;12607.180533265308;10393.9480302598;11412.42937853104;12523.686907827196;12553.937230313973;12613.243205407705;5363.892722145535;5414.3232095988005;5420.24116623673;5422.864428389322;5464.836054918359;1116.6873275482878;1131.9264247823864;1133.0708818768696;1159.1596092832797;1195.6652137401368;21698.457538561346;26295.34261643436;26458;26626.866865665936;26887.731122688914;1231.5812623707982;1238.4984081447028;1242.6334231401759;1283.6020833541631;1291.6835375332917;13613.795793063113;13905.721885562232;14512.637184070272;14831.332590033475;15016.399344026335;485687;488674;488713;488937;489849;40014;49254;49331.50668493341;49370.50629493731;49393.50606493961;1381.3990913952464;1432.2480697633616;1439.0933711761522;1439.7912302716256;1442.3365251983996;26695.733042669326;27004.594931075655;27417.31456713598;27632.585511216945;27778.86110569434;40754;40817;40851.77444676664;40884;40959.38560921648;378481.10759446025;442098;442343;442685;443484;28904.42191156123;29401.970931017313;29498.410031798816;29504.557431638113;29515.81936722507;36970.44544331783;37739;37776.81111594424;37811;37831;28686.56970145491;29443.411131777673;30894.69105308918;31044.379112418075;32457.35085298328;31267.905623303075;31473.8426307867;32065.19837004;32086;32430;30699.539506906967;31359.372812543166;31716.682833172297;31787.046388608378;31835.20411989626;26946.865265673547;28514.714852852037;28527.857360713064;28697.569536457388;29005.419891602472;21723.661588304636;21781.78218217861;22066.8966551675;22083.66874496916;22095.889520552293 08:28:45 INFO - PROCESS | 1661 | |2;jquery.html;388.84446221511377;405.84375015618997;424.6730017886227;428.51577717179595;448.51112287606503;14127;20907.895460522694;21764.564708705817;21816.127354905824;21962.560748785014;21720.891395543;22298;22641;22886.427839304026;23025.654615180745;6625.536212465129;6719.697613607399;6724.966375168117;6735.326467353275;6909.3090690931;4216.135692183095;6634.601923884558;6772.119624448815;6796.456283497333;6807.217170025436;4395.494518130424;4401.119776044788;4495.415595972519;7828.295453409192;7892.4869883457395;7525.698972041167;7708.460407771458;7773.106092799316;7794.688212471494;7804.531728096275;6607.669616519155;7520.909468127091;7583;7584.4690871639;7596.582187979659;24432.633510497355;27128.32179195516;27432.451350973068;28359.716402835915;28734.425311493862;2982.3587928595457;2994.4609970205356;2998.3253767902265;3026.969730302713;3034.7723920705816;16335.673286534322;16682.833171668248;17010.744838827428;17567.73648395275;17713.38003169896;2075.356639441778;2116.714243577113;2155.760437748301;2156.795104465073;2226.543558570489;118203;130118;141627.2535471802;157208;170623.14688426603;18462.81537184638;23573.29280121599;23692.170774022827;24416.26751197467;25694.357641059123;28844;44648.3302750459;45313.773431132635;45607.543924560996;45696.54303456989;10311.381317120997;10494.527746251437;10576.259661823598;10604.469776511143;10722.78554428907;7306.4885458017425;8885.733427997171;8897.955510222537;9068.727938161866;9069.31980101495;8498;8819.55961968514;9436.952815236018;9587.274290627614;9619.230461563058;3349.069564131385;3708.1841994761107;3978.622030907059;3982.6415622594104;4023.657989070903;897.7800438892513;899.8875140607424;904.9457032577935;939.2251392601131;949.5679465843025;19762;22416.32751017472;22995.540089198457;23023.19418820333;23050.193243236743;922.3405265235389;926.1618235496886;948.6252930092713;952.8380175370204;953.9046095390405;11386.993545047815;11875.584354547549;12103;12126.818097728365;12131.696707582381;654900;717937;780663;789726;806473;123324;166745;167552.16223918804;168696;171637;1208.256921992968;1220.9084318676134;1234.5432190089546;1245.1284101129245;1287.0025730059092;20355.59288814245;21554.245601403876;21567.784322157204;21591.568168636855;21646.6752998702;68029.63940721059;68346.65826670834;68511;69457;69512;97764;100230;100320.99679003116;100517;100921.48617770593;11251.268667536584;11652.592159274385;11844.348560829238;11895.940520297343;11932.28406295625;13129.60611181666;13286.20282783036;13288.601341959757;13635.977301702214;13735.725285494435;10540;11362.261453005529;11470.197086203885;11607.883921160681;11626.895444933056;9864.210863131077;10870.239083264096;11470.254433461798;11661.008814250883;11823.349715765715;11745.823812642646;11816.40917954116;11871.881281187078;11895.583654572049;11928.343941082976;11619.5352185915;11890.346030968034;11918.284902905853;12003.459844307201;12015.459304331502;11074.446277685922;11407.657770266906;11437;11617.244879082833;11635 08:28:45 INFO - PROCESS | 1661 | |3;mootools.html;1517.5523220649907;1530.09724262685;1536.830948595655;1558.773977773223;1558.9454369097084;10541.63104291349;11094.334339939609;11149.888501114987;11172.994430501254;11441.942790286057;10962.397068161248;11089.667309980714;11097.889021109786;11102.500387482563;11103.666889993314;2421.5399074175893;2459.532688789124;2460.520198561281;2463.0763463701114;2469.234537293436;2390.7499566713745;2428.8178386620984;2435.9878200608973;2436.1717016214484;2441.2310122311505;2392.820538459614;2412.8190385721055;2421.5641184586766;2427.5994460914017;2429.2712186344024;2337.111897478947;2365.1485465232504;2367.4673198530363;2371.6679664846934;2377.2986968844234;2317.7102862142233;2340.0990618611786;2372.9288121356385;2384.3562238195764;2386.820988425875;10955.671329860117;11031.503582338813;11045.226834121615;11059.889401105966;11062.502187401586;5737.254156959611;5937.614055086406;5940.613860099123;5946.167536544887;5960.761569537213;3517.7009954153928;3606.9098272543133;3657.524521812174;3683.28176005679;3691.3909204981146;1171.3674615707507;1199.0707201918497;1230.3848075962019;1235.579902833032;1256.704674401515;13579.524716634969;13760.31198440074;13818.96357773171;14122.082064665763;14426.990110692255;4066.674666026711;4304.935425968613;4394.099209662011;4416.514183439819;4429.712068715523;11540.826887596693;11696.70758231051;11699;11704.88295117055;11708.473118709679;5098.954714283563;5899.646021238654;5923.348431672513;5923.585349025527;5945.40545945402;5034.244863270465;5036.068327359377;5130.819911420394;5227.242049902743;5381.811636592701;3399.8810041648917;3869.845206191777;3919.2161567686576;3964.286428442908;4001.339778936443;1055.9155267578728;1056.1234175634206;1061.697416236369;1074.4466599701161;1076.187478453778;798.7084714079319;837.7444879311746;916.6322473414186;928.4754113925745;930.8417569013284;6399.520035997319;6415.615063096229;6453.741850326029;6503.414692677682;6638.634875081821;986.4525188520297;997.9351342162736;1008.5007921079113;1009.1573536097294;1021.6168936648756;4060.4315395844606;4071.4096456014304;4132.718857154292;4233.745975241495;4263.317869140923;12876.420561074774;13043.804342934864;13274.867251327556;13642.727145457235;13709.794353084711;13185.604431866868;13322.800157997637;13555.932220338835;13577.660558486117;13590;8644.740657780276;8784.253338466175;9729.4648794317;10011.299209055442;10048.246381521416;6553.115329430466;6589.703463344065;6632.237292711207;6740.090087838079;6755.932440675727;11930.164888457724;12078.51685932553;12170.14808963364;12218;12371.13402061847;12180.208286461351;12362.44369003379;12527.060470464568;12615.93692031534;12689.87310126887;9223.354365194373;9225.677101301422;9321.207697345802;9332.486713230837;9420.811583768424;10182.134518565708;10197.59209631636;10306.12397946183;10309.845352319871;10311.742206444898;9027.50348730826;9058.411203271766;9125.77185570366;9196.08039196075;9364.438133712;8777.692780752643;8845;8903.287736980896;8941.642334306815;9031.954840225757;6441.838954026;7734.8839767402405;7789.961050194939;7870.212978702084;7878.803029924297;5851.180834683233;5854.151148083589;5940.702964851826;5951.815778558451;5958.9869722148205;5359.973200133974;5814.680192589279;5869.882602348014;5900.822975310747;6045.153678485103 08:28:45 INFO - PROCESS | 1661 | |4;prototype.html;361.3964678986093;378.1831244511855;380.19398874386286;382.40726873346307;394.8420631747301;4141.482314710661;4803.783829727662;4837;4999.775010124544;5149.974250128754;4128.266128226145;4346.370111208297;4547.022390186109;4973;5019.723915184663;4156.355764856452;4195.28680124378;4203.7687927164;4220.514640816307;4291.399204111412;3439.850093691443;3627.9320787151332;4049.9392509112386;4230.97884510577;4290.249206388885;4273.9358909616385;4286.8854097934445;4301.526832048487;4308.956910430887;4320.848770293024;3324.650911654278;4045.7167998240134;4227.513835908879;4259.212045771542;4326.459192600925;3368.932621347584;3438.398280300962;3582.5459560201343;3637.618050104754;3869.729118961674;4209.663226941868;4294.4202532658;4915.361003069578;4916.631252656065;5021.447640759514;4137.944824069873;4191.140816132685;4548.818047278105;4900.558949694509;5015.5736762375245;5045.05765280366;5373.81191658294;5389.73051347435;5481.479259470344;5542.8337149885565;4389.626881715058;4395.230834603964;4396.274614688573;4406.955930440687;4410.16206920684;4979.45226025137;5378.704171270579;5535.280413546213;5734.913976290359;5902;3813.4851795007876;4406.471223453206;4408.206522825923;4429.75636339998;4493.820247190141;4166;4404.713693609905;4613.492515823256;4613.792379342937;4640.883977900512;4693.718376897397;4752.621739695519;4818.349522814376;4883.536064073907;4926.556609905054;4961.330220420269;5101.540861322499;5390.9191362129595;5457.972710136424;5479.958807826501;1286.5239861251398;1417.4471955937192;1534.986908640292;1536.7694845773224;1556.6341909651223;955.507913424573;1017.5573625472942;1091.4597274349248;1172.9941350293363;1174.2250114924109;4721.905561888743;4739.431268247832;5037.672551284155;5078.568321692697;5102.540771330524;4636.609017294798;4909.459959404463;5303.867403314871;5541.556675465953;5758.712064396764;3903.9414408783323;4499.707519011254;4513.977430112894;4701.717896926195;4976.800927962841;2627.6452678888104;2818.746312831855;2917.2852651100193;2927.838968856691;2940.617719696426;5374.892502149935;5599.776008959678;5753.913691294634;5862.882742345215;5893.17311633395;4453.726511014402;5391.137418013178;5679.858003549862;5797.507211886952;5868.530517558585;5032.993401319677;5335.146376579806;5412.052890744104;5681.857953551194;5935.614185077956;4087.5708050655444;4950.232713929347;5021.84934451967;5316.0761581131;5557.861053473695;4877.561019508261;5054.559450556574;5464.907018596217;5492.725363731717;5511.779528818963;5300.469953004823;5560.972195138998;5729.885402292014;5784.94215057844;5835.708214589169;3973.841046358229;4346.869593912188;4389.341598760211;4472.329150627302;4523.185826551252;4369.788205668894;4898.608111351012;5200.037992971313;5383.981830434085;5406.729663516887;4883.658143929891;5476.67139971603;5482.80810171642;5495.368032676133;5509.724513774215;4910.94414700841;5523.7238138093735;5533;5541.5843811715085;5542.8337149885565;4476.865694029184;4642.862498687843;4843.789052736815;5282.909497943746;5364.544013758874;4966.34300649151;5216.504432078947;5551.695351592453;5563.385208951786;5598.412166722435;4906.95093049065;5110.540051395392;5287.836675931289;5298.708571028476;5504.366997795305 08:28:45 INFO - PROCESS | 1661 | |5;yui.html;622.6450922973901;745.3515441565838;776.8912352270684;820.7578764264541;830.2983978538133;15390.769138462918;16113.677726445465;16118.838811611895;16195.595110122238;16200.837991620081;12351.444185011673;14621.634459138528;14643.707125857476;14760.409583616669;14783.630409239748;949.8955114937369;950.5152372290147;968.4528241543541;983.4640121133999;984.9458279794609;954.8710924025237;964.7154089543601;974.8440249560072;974.9178411962715;978.8433850583908;1017.0795430135702;1017.0897047142839;1017.5675337981365;1020.0054946427211;1021.2289721260476;1008.374807619277;1009.152312057875;1010.3836659637615;1012.6000229909145;1012.6658202793061;756.1342263108764;756.8334966307403;759.4531937005347;759.5632511305965;760.4144808497481;15954.840451595452;16201;16222.351105955748;16425.425110121207;16691.66616667672;14029.64925876851;14151.504697335544;14258.429662813474;14301;14312.642183945485;11207.551697932073;11820.113491488173;11858.525658973716;11863.228890122115;11885.405729713566;3628.546431696038;3640.6359364063383;3697.9445308320396;3771.6605505504363;3867.671247943928;49016;76790.61604691941;103621;104022.47988760007;109412.4529377356;10695.78608427827;10747.78504429907;11008.39453830031;11261.155413344031;11324.886751132382;22314.776852231593;22317.55364892693;22375.328740137822;22375.664365034536;22403;7235.131784185932;7715.4599178057;7745.806354841174;7885.487443316166;8066.11272759996;4250.468691413574;4262.403263543107;4317.546657600969;4408.625266852289;4496.123255965055;3432.2105915639545;3526.400511912981;3529.505869178317;3538.5399898013093;3549.982250088785;629.6883042893797;659.9375006240045;660.4056349285681;660.5805313625882;660.6663634864362;675.321302091395;688.5042769206264;694.5103701890155;706.4489698035541;708.7200555780438;9272.397294175857;10254.948725256327;10260.384376937407;10318.638847640446;10533.525991330409;662.920449546048;666.1872515531045;695.7823808335413;712.5404114346218;717.6949796336536;3938.8030598469963;4387.358056062945;4967.181833621382;5054.848354549369;5092.516210959953;90486;106465.4676726627;108517;109750.90249097567;111030;59665.10502342469;62987.6850615744;76995.46009079787;79592.60203698944;83009;74262.88605670919;74979.12552186238;75162.24837751553;75184.87222691774;79299.20700792919;10806.621768238074;10938.562457501928;11087.417927915316;11208.887911120784;11228.831567526657;48264.7586762078;50283.74290642763;50335.24497132619;51353;53162.93674126419;62937;63185.47258109808;63535.36464635479;63935.68032159809;64839.67580162069;10132.392056476636;12253.180674233206;12416.81374779397;12530.74938501243;12880.935595322338;12903.161294515827;14173.787393188904;14318.355673994487;14738.852611474176;14799.778003329744;13204.471821127046;13298.704394333028;13372.06395552302;13750.174989500661;13795.931020344835;12939.676508087374;13492.59522214335;13562.118462300314;13597.660058498617;13979.930100349433;12631.557895473614;13289.86710132925;13443.798343024668;13480.393382297623;13667.19822436418;11046.558137674403;11154.330740155616;11159;11261.49323280438;11295.548178072784;11063.336199828036;11069.54312705909;11308.717282068013;11319.547218111184;11334.886651133384 08:28:45 INFO - PROCESS | 1661 | __end_tp_report 08:28:45 INFO - PROCESS | 1661 | __start_cc_report 08:28:45 INFO - PROCESS | 1661 | _x_x_mozilla_cycle_collect,2088 08:28:45 INFO - PROCESS | 1661 | __end_cc_report 08:28:45 INFO - PROCESS | 1661 | __startTimestamp1489332525498__endTimestamp 08:28:45 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | ------- Summary: start ------- 08:28:45 INFO - PROCESS | 1661 | Number of tests: 6 08:28:45 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | [#0] dojo.html Cycles:165 Average:5959.09 Median:6193.81 stddev:649.58 (10.5%) stddev-sans-first:619.61 08:28:45 INFO - PROCESS | 1661 | Values: 3393.7 3420.5 3452.6 3485.0 3489.2 6000.3 6027.1 6040.3 6053.8 6060.1 6029.5 6101.6 6104.5 6115.4 6125.9 5426.0 5448.7 5489.6 5491.9 5572.6 5356.8 5358.7 5401.5 5532.9 5586.6 5432.8 5462.6 5464.5 5465.6 5468.8 5434.4 5461.2 5462.6 5468.0 5472.9 5277.6 5392.0 5405.5 5410.2 5424.9 5095.8 6070.6 6079.4 6088.4 6092.6 6218.8 6228.9 6242.1 6250.6 6250.8 6297.3 6299.7 6305.4 6448.9 6457.1 6094.0 6143.8 6149.4 6154.0 6154.4 6376.3 6667.9 6671.2 6672.5 6675.6 6168.2 6267.8 6278.0 6294.6 6303.0 6320.2 6426.4 6441.8 6467.4 6525.1 6399.8 6401.3 6408.8 6416.1 6416.8 6425.9 6429.6 6434.4 6434.6 6458.5 5071.7 5116.5 5155.2 5156.7 5169.4 4617.7 4622.6 4624.1 4632.5 4634.4 5901.1 5934.1 5935.9 5945.3 5950.4 5130.4 6239.3 6254.9 6370.1 6390.5 6068.3 6073.5 6075.7 6096.6 6099.6 5694.4 5696.0 5710.9 5724.9 5724.9 6430.3 6448.9 6521.4 6545.7 6548.7 6319.3 6326.4 6330.1 6346.9 6426.8 6668.9 6687.7 6693.8 6695.7 6695.7 6382.8 6382.8 6388.5 6399.3 6415.6 6264.6 6266.1 6474.9 6479.2 6479.3 6151.5 6224.0 6248.5 6251.1 6254.0 6193.8 6224.1 6291.8 6320.0 6332.2 6210.3 6220.0 6233.8 6241.6 6253.9 6157.7 6191.3 6290.1 6293.7 6305.3 6146.3 6158.5 6198.5 6218.2 6229.9 08:28:45 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | [#1] ext.html Cycles:180 Average:54005.37 Median:16992.88 stddev:110150.67 (648.2%) stddev-sans-first:110387.20 08:28:45 INFO - PROCESS | 1661 | Values: 784.7 818.1 872.0 893.3 896.0 39123.4 39413.4 39464.0 39541.4 41944.6 40808.0 41139.6 41141.8 41145.4 41456.0 7315.0 7484.0 9085.9 9282.8 9290.5 7380.6 7470.1 7513.5 8877.7 11122.9 11101.6 11138.2 11183.5 11192.3 11211.4 11117.6 11132.2 11156.3 11160.7 11161.6 10889.2 10936.0 10939.8 10940.9 10967.8 39450.8 39500.0 39615.6 39770.8 39909.0 3788.6 3816.6 3849.3 3903.6 3923.4 27483.0 29179.7 29265.6 29387.1 29430.6 2288.2 2764.9 3012.5 3091.1 3092.1 242328.0 266920.0 269119.0 354867.0 356114.0 42968.8 52462.0 52620.5 52658.5 52720.0 54528.5 54566.0 54914.7 54916.7 54936.5 14726.6 14805.6 14819.5 14837.0 14840.7 12570.3 12573.1 12587.6 12599.1 12607.2 10393.9 11412.4 12523.7 12553.9 12613.2 5363.9 5414.3 5420.2 5422.9 5464.8 1116.7 1131.9 1133.1 1159.2 1195.7 21698.5 26295.3 26458.0 26626.9 26887.7 1231.6 1238.5 1242.6 1283.6 1291.7 13613.8 13905.7 14512.6 14831.3 15016.4 485687.0 488674.0 488713.0 488937.0 489849.0 40014.0 49254.0 49331.5 49370.5 49393.5 1381.4 1432.2 1439.1 1439.8 1442.3 26695.7 27004.6 27417.3 27632.6 27778.9 40754.0 40817.0 40851.8 40884.0 40959.4 378481.1 442098.0 442343.0 442685.0 443484.0 28904.4 29402.0 29498.4 29504.6 29515.8 36970.4 37739.0 37776.8 37811.0 37831.0 28686.6 29443.4 30894.7 31044.4 32457.4 31267.9 31473.8 32065.2 32086.0 32430.0 30699.5 31359.4 31716.7 31787.0 31835.2 26946.9 28514.7 28527.9 28697.6 29005.4 21723.7 21781.8 22066.9 22083.7 22095.9 08:28:45 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | [#2] jquery.html Cycles:180 Average:44081.68 Median:23009.37 stddev:125517.28 (545.5%) stddev-sans-first:125826.52 08:28:45 INFO - PROCESS | 1661 | Values: 388.8 405.8 424.7 428.5 448.5 14127.0 20907.9 21764.6 21816.1 21962.6 21720.9 22298.0 22641.0 22886.4 23025.7 6625.5 6719.7 6725.0 6735.3 6909.3 4216.1 6634.6 6772.1 6796.5 6807.2 4395.5 4401.1 4495.4 7828.3 7892.5 7525.7 7708.5 7773.1 7794.7 7804.5 6607.7 7520.9 7583.0 7584.5 7596.6 24432.6 27128.3 27432.5 28359.7 28734.4 2982.4 2994.5 2998.3 3027.0 3034.8 16335.7 16682.8 17010.7 17567.7 17713.4 2075.4 2116.7 2155.8 2156.8 2226.5 118203.0 130118.0 141627.3 157208.0 170623.1 18462.8 23573.3 23692.2 24416.3 25694.4 28844.0 44648.3 45313.8 45607.5 45696.5 10311.4 10494.5 10576.3 10604.5 10722.8 7306.5 8885.7 8898.0 9068.7 9069.3 8498.0 8819.6 9437.0 9587.3 9619.2 3349.1 3708.2 3978.6 3982.6 4023.7 897.8 899.9 904.9 939.2 949.6 19762.0 22416.3 22995.5 23023.2 23050.2 922.3 926.2 948.6 952.8 953.9 11387.0 11875.6 12103.0 12126.8 12131.7 654900.0 717937.0 780663.0 789726.0 806473.0 123324.0 166745.0 167552.2 168696.0 171637.0 1208.3 1220.9 1234.5 1245.1 1287.0 20355.6 21554.2 21567.8 21591.6 21646.7 68029.6 68346.7 68511.0 69457.0 69512.0 97764.0 100230.0 100321.0 100517.0 100921.5 11251.3 11652.6 11844.3 11895.9 11932.3 13129.6 13286.2 13288.6 13636.0 13735.7 10540.0 11362.3 11470.2 11607.9 11626.9 9864.2 10870.2 11470.3 11661.0 11823.3 11745.8 11816.4 11871.9 11895.6 11928.3 11619.5 11890.3 11918.3 12003.5 12015.5 11074.4 11407.7 11437.0 11617.2 11635.0 08:28:45 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | [#3] mootools.html Cycles:180 Average:6670.19 Median:2450.38 stddev:4122.82 (168.3%) stddev-sans-first:4116.21 08:28:45 INFO - PROCESS | 1661 | Values: 1517.6 1530.1 1536.8 1558.8 1558.9 10541.6 11094.3 11149.9 11173.0 11441.9 10962.4 11089.7 11097.9 11102.5 11103.7 2421.5 2459.5 2460.5 2463.1 2469.2 2390.7 2428.8 2436.0 2436.2 2441.2 2392.8 2412.8 2421.6 2427.6 2429.3 2337.1 2365.1 2367.5 2371.7 2377.3 2317.7 2340.1 2372.9 2384.4 2386.8 10955.7 11031.5 11045.2 11059.9 11062.5 5737.3 5937.6 5940.6 5946.2 5960.8 3517.7 3606.9 3657.5 3683.3 3691.4 1171.4 1199.1 1230.4 1235.6 1256.7 13579.5 13760.3 13819.0 14122.1 14427.0 4066.7 4304.9 4394.1 4416.5 4429.7 11540.8 11696.7 11699.0 11704.9 11708.5 5099.0 5899.6 5923.3 5923.6 5945.4 5034.2 5036.1 5130.8 5227.2 5381.8 3399.9 3869.8 3919.2 3964.3 4001.3 1055.9 1056.1 1061.7 1074.4 1076.2 798.7 837.7 916.6 928.5 930.8 6399.5 6415.6 6453.7 6503.4 6638.6 986.5 997.9 1008.5 1009.2 1021.6 4060.4 4071.4 4132.7 4233.7 4263.3 12876.4 13043.8 13274.9 13642.7 13709.8 13185.6 13322.8 13555.9 13577.7 13590.0 8644.7 8784.3 9729.5 10011.3 10048.2 6553.1 6589.7 6632.2 6740.1 6755.9 11930.2 12078.5 12170.1 12218.0 12371.1 12180.2 12362.4 12527.1 12615.9 12689.9 9223.4 9225.7 9321.2 9332.5 9420.8 10182.1 10197.6 10306.1 10309.8 10311.7 9027.5 9058.4 9125.8 9196.1 9364.4 8777.7 8845.0 8903.3 8941.6 9032.0 6441.8 7734.9 7790.0 7870.2 7878.8 5851.2 5854.2 5940.7 5951.8 5959.0 5360.0 5814.7 5869.9 5900.8 6045.2 08:28:45 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | [#4] prototype.html Cycles:180 Average:4486.65 Median:4860.68 stddev:1261.39 (26.0%) stddev-sans-first:1226.34 08:28:45 INFO - PROCESS | 1661 | Values: 361.4 378.2 380.2 382.4 394.8 4141.5 4803.8 4837.0 4999.8 5150.0 4128.3 4346.4 4547.0 4973.0 5019.7 4156.4 4195.3 4203.8 4220.5 4291.4 3439.9 3627.9 4049.9 4231.0 4290.2 4273.9 4286.9 4301.5 4309.0 4320.8 3324.7 4045.7 4227.5 4259.2 4326.5 3368.9 3438.4 3582.5 3637.6 3869.7 4209.7 4294.4 4915.4 4916.6 5021.4 4137.9 4191.1 4548.8 4900.6 5015.6 5045.1 5373.8 5389.7 5481.5 5542.8 4389.6 4395.2 4396.3 4407.0 4410.2 4979.5 5378.7 5535.3 5734.9 5902.0 3813.5 4406.5 4408.2 4429.8 4493.8 4166.0 4404.7 4613.5 4613.8 4640.9 4693.7 4752.6 4818.3 4883.5 4926.6 4961.3 5101.5 5390.9 5458.0 5480.0 1286.5 1417.4 1535.0 1536.8 1556.6 955.5 1017.6 1091.5 1173.0 1174.2 4721.9 4739.4 5037.7 5078.6 5102.5 4636.6 4909.5 5303.9 5541.6 5758.7 3903.9 4499.7 4514.0 4701.7 4976.8 2627.6 2818.7 2917.3 2927.8 2940.6 5374.9 5599.8 5753.9 5862.9 5893.2 4453.7 5391.1 5679.9 5797.5 5868.5 5033.0 5335.1 5412.1 5681.9 5935.6 4087.6 4950.2 5021.8 5316.1 5557.9 4877.6 5054.6 5464.9 5492.7 5511.8 5300.5 5561.0 5729.9 5784.9 5835.7 3973.8 4346.9 4389.3 4472.3 4523.2 4369.8 4898.6 5200.0 5384.0 5406.7 4883.7 5476.7 5482.8 5495.4 5509.7 4910.9 5523.7 5533.0 5541.6 5542.8 4476.9 4642.9 4843.8 5282.9 5364.5 4966.3 5216.5 5551.7 5563.4 5598.4 4907.0 5110.5 5287.8 5298.7 5504.4 08:28:45 INFO - PROCESS | 1661 | 08:28:45 INFO - PROCESS | 1661 | [#5] yui.html Cycles:180 Average:19552.64 Median:19503.22 stddev:27274.27 (139.8%) stddev-sans-first:27313.74 08:28:45 INFO - PROCESS | 1661 | Values: 622.6 745.4 776.9 820.8 830.3 15390.8 16113.7 16118.8 16195.6 16200.8 12351.4 14621.6 14643.7 14760.4 14783.6 949.9 950.5 968.5 983.5 984.9 954.9 964.7 974.8 974.9 978.8 1017.1 1017.1 1017.6 1020.0 1021.2 1008.4 1009.2 1010.4 1012.6 1012.7 756.1 756.8 759.5 759.6 760.4 15954.8 16201.0 16222.4 16425.4 16691.7 14029.6 14151.5 14258.4 14301.0 14312.6 11207.6 11820.1 11858.5 11863.2 11885.4 3628.5 3640.6 3697.9 3771.7 3867.7 49016.0 76790.6 103621.0 104022.5 109412.5 10695.8 10747.8 11008.4 11261.2 11324.9 22314.8 22317.6 22375.3 22375.7 22403.0 7235.1 7715.5 7745.8 7885.5 8066.1 4250.5 4262.4 4317.5 4408.6 4496.1 3432.2 3526.4 3529.5 3538.5 3550.0 629.7 659.9 660.4 660.6 660.7 675.3 688.5 694.5 706.4 708.7 9272.4 10254.9 10260.4 10318.6 10533.5 662.9 666.2 695.8 712.5 717.7 3938.8 4387.4 4967.2 5054.8 5092.5 90486.0 106465.5 108517.0 109750.9 111030.0 59665.1 62987.7 76995.5 79592.6 83009.0 74262.9 74979.1 75162.2 75184.9 79299.2 10806.6 10938.6 11087.4 11208.9 11228.8 48264.8 50283.7 50335.2 51353.0 53162.9 62937.0 63185.5 63535.4 63935.7 64839.7 10132.4 12253.2 12416.8 12530.7 12880.9 12903.2 14173.8 14318.4 14738.9 14799.8 13204.5 13298.7 13372.1 13750.2 13795.9 12939.7 13492.6 13562.1 13597.7 13979.9 12631.6 13289.9 13443.8 13480.4 13667.2 11046.6 11154.3 11159.0 11261.5 11295.5 11063.3 11069.5 11308.7 11319.5 11334.9 08:28:45 INFO - PROCESS | 1661 | -------- Summary: end -------- 08:28:45 INFO - PROCESS | 1661 | 08:28:46 INFO - TEST-INFO | 1661: exit 0 08:28:46 INFO - TEST-OK | dromaeo_css | took 1120961ms 08:28:46 INFO - TEST-START | kraken 08:28:46 INFO - operating with platform_type : mac_ 08:28:46 INFO - Initialising browser for kraken test... 08:28:46 INFO - TEST-INFO | started process 1691 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/tmp3HOdCt/profile http://localhost:49250/getInfo.html) 08:28:48 INFO - PROCESS | 1691 | __metrics Screen width/height:1600/1200 08:28:48 INFO - PROCESS | 1691 | colorDepth:24 08:28:48 INFO - PROCESS | 1691 | Browser inner width/height: 1024/689 08:28:48 INFO - PROCESS | 1691 | __metrics 08:28:48 INFO - PROCESS | 1691 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:28:48 INFO - PROCESS | 1691 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:28:49 INFO - TEST-INFO | 1691: exit 0 08:28:49 INFO - Browser initialized. 08:28:49 INFO - Running cycle 1/1 for kraken test... 08:28:49 INFO - TEST-INFO | started process 1692 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/T/tmp3HOdCt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:29:01 INFO - PROCESS | 1692 | RSS: Main: 214392832 08:29:01 INFO - PROCESS | 1692 | 08:29:04 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49250/tests/kraken/driver.html?testName=audio-beat-detection) 08:29:05 INFO - PROCESS | 1692 | RSS: Main: 267325440 08:29:05 INFO - PROCESS | 1692 | 08:29:07 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49250/tests/kraken/driver.html?testName=audio-dft) 08:29:08 INFO - PROCESS | 1692 | RSS: Main: 277725184 08:29:08 INFO - PROCESS | 1692 | 08:29:11 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49250/tests/kraken/driver.html?testName=audio-fft) 08:29:12 INFO - PROCESS | 1692 | RSS: Main: 375123968 08:29:12 INFO - PROCESS | 1692 | 08:29:14 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49250/tests/kraken/driver.html?testName=audio-oscillator) 08:29:14 INFO - PROCESS | 1692 | RSS: Main: 277921792 08:29:14 INFO - PROCESS | 1692 | 08:29:16 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49250/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:29:17 INFO - PROCESS | 1692 | RSS: Main: 279433216 08:29:17 INFO - PROCESS | 1692 | 08:29:20 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49250/tests/kraken/driver.html?testName=imaging-darkroom) 08:29:21 INFO - PROCESS | 1692 | RSS: Main: 320139264 08:29:21 INFO - PROCESS | 1692 | 08:29:24 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49250/tests/kraken/driver.html?testName=imaging-desaturate) 08:29:25 INFO - PROCESS | 1692 | RSS: Main: 321597440 08:29:25 INFO - PROCESS | 1692 | 08:29:28 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49250/tests/kraken/driver.html?testName=json-parse-financial) 08:29:28 INFO - PROCESS | 1692 | RSS: Main: 318173184 08:29:28 INFO - PROCESS | 1692 | 08:29:30 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49250/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:29:31 INFO - PROCESS | 1692 | RSS: Main: 296034304 08:29:31 INFO - PROCESS | 1692 | 08:29:32 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49250/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:29:33 INFO - PROCESS | 1692 | RSS: Main: 300363776 08:29:33 INFO - PROCESS | 1692 | 08:29:35 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49250/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:29:36 INFO - PROCESS | 1692 | RSS: Main: 303902720 08:29:36 INFO - PROCESS | 1692 | 08:29:39 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49250/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:29:39 INFO - PROCESS | 1692 | RSS: Main: 319991808 08:29:39 INFO - PROCESS | 1692 | 08:29:42 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49250/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:29:43 INFO - PROCESS | 1692 | RSS: Main: 313946112 08:29:43 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | Cycle 1(1): loaded http://localhost:49250/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49250/tests/kraken/driver.html?testName=ai-astar) 08:29:45 INFO - PROCESS | 1692 | RSS: Main: 358473728 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | __start_tp_report 08:29:45 INFO - PROCESS | 1692 | _x_x_mozilla_page_load 08:29:45 INFO - PROCESS | 1692 | _x_x_mozilla_page_load_details 08:29:45 INFO - PROCESS | 1692 | |i|pagename|runs| 08:29:45 INFO - PROCESS | 1692 | |0;ai-astar;115;115;115;114;115;115;114;113;114;115 08:29:45 INFO - PROCESS | 1692 | |1;audio-beat-detection;133;108;109;141;109;119;105;106;118;135 08:29:45 INFO - PROCESS | 1692 | |2;audio-dft;185;185;184;182;185;185;182;184;185;185 08:29:45 INFO - PROCESS | 1692 | |3;audio-fft;83;60;60;95;62;61;65;58;75;60 08:29:45 INFO - PROCESS | 1692 | |4;audio-oscillator;90;67;85;95;99;97;82;67;55;80 08:29:45 INFO - PROCESS | 1692 | |5;imaging-gaussian-blur;87;89;88;87;78;88;81;121;99;87 08:29:45 INFO - PROCESS | 1692 | |6;imaging-darkroom;94;95;95;95;96;95;96;95;96;94 08:29:45 INFO - PROCESS | 1692 | |7;imaging-desaturate;81;86;83;86;83;85;86;83;84;86 08:29:45 INFO - PROCESS | 1692 | |8;json-parse-financial;62;61;60;61;66;64;63;61;65;92 08:29:45 INFO - PROCESS | 1692 | |9;json-stringify-tinderbox;57;56;65;62;59;60;57;57;56;58 08:29:45 INFO - PROCESS | 1692 | |10;stanford-crypto-aes;83;86;83;88;82;82;80;83;83;89 08:29:45 INFO - PROCESS | 1692 | |11;stanford-crypto-ccm;140;139;136;140;141;132;140;143;179;139 08:29:45 INFO - PROCESS | 1692 | |12;stanford-crypto-pbkdf2;167;165;162;167;167;163;164;164;165;166 08:29:45 INFO - PROCESS | 1692 | |13;stanford-crypto-sha256-iterative;64;66;66;63;65;64;64;65;68;80 08:29:45 INFO - PROCESS | 1692 | __end_tp_report 08:29:45 INFO - PROCESS | 1692 | __start_cc_report 08:29:45 INFO - PROCESS | 1692 | _x_x_mozilla_cycle_collect,2178 08:29:45 INFO - PROCESS | 1692 | __end_cc_report 08:29:45 INFO - PROCESS | 1692 | __startTimestamp1489332585327__endTimestamp 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | ------- Summary: start ------- 08:29:45 INFO - PROCESS | 1692 | Number of tests: 14 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#0] ai-astar Cycles:10 Average:114.50 Median:115.00 stddev:0.71 (0.6%) stddev-sans-first:0.73 08:29:45 INFO - PROCESS | 1692 | Values: 115.0 115.0 115.0 114.0 115.0 115.0 114.0 113.0 114.0 115.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#1] audio-beat-detection Cycles:10 Average:118.30 Median:118.50 stddev:13.41 (11.3%) stddev-sans-first:13.12 08:29:45 INFO - PROCESS | 1692 | Values: 133.0 108.0 109.0 141.0 109.0 119.0 105.0 106.0 118.0 135.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#2] audio-dft Cycles:10 Average:184.20 Median:185.00 stddev:1.23 (0.7%) stddev-sans-first:1.27 08:29:45 INFO - PROCESS | 1692 | Values: 185.0 185.0 184.0 182.0 185.0 185.0 182.0 184.0 185.0 185.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#3] audio-fft Cycles:10 Average:67.90 Median:63.50 stddev:12.42 (19.6%) stddev-sans-first:11.91 08:29:45 INFO - PROCESS | 1692 | Values: 83.0 60.0 60.0 95.0 62.0 61.0 65.0 58.0 75.0 60.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#4] audio-oscillator Cycles:10 Average:81.70 Median:87.50 stddev:14.67 (16.8%) stddev-sans-first:15.25 08:29:45 INFO - PROCESS | 1692 | Values: 90.0 67.0 85.0 95.0 99.0 97.0 82.0 67.0 55.0 80.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#5] imaging-gaussian-blur Cycles:10 Average:90.50 Median:87.50 stddev:12.02 (13.7%) stddev-sans-first:12.68 08:29:45 INFO - PROCESS | 1692 | Values: 87.0 89.0 88.0 87.0 78.0 88.0 81.0 121.0 99.0 87.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#6] imaging-darkroom Cycles:10 Average:95.10 Median:95.00 stddev:0.74 (0.8%) stddev-sans-first:0.67 08:29:45 INFO - PROCESS | 1692 | Values: 94.0 95.0 95.0 95.0 96.0 95.0 96.0 95.0 96.0 94.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#7] imaging-desaturate Cycles:10 Average:84.30 Median:85.50 stddev:1.77 (2.1%) stddev-sans-first:1.41 08:29:45 INFO - PROCESS | 1692 | Values: 81.0 86.0 83.0 86.0 83.0 85.0 86.0 83.0 84.0 86.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#8] json-parse-financial Cycles:10 Average:65.50 Median:63.50 stddev:9.51 (15.0%) stddev-sans-first:10.01 08:29:45 INFO - PROCESS | 1692 | Values: 62.0 61.0 60.0 61.0 66.0 64.0 63.0 61.0 65.0 92.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#9] json-stringify-tinderbox Cycles:10 Average:58.70 Median:58.50 stddev:2.91 (5.0%) stddev-sans-first:3.02 08:29:45 INFO - PROCESS | 1692 | Values: 57.0 56.0 65.0 62.0 59.0 60.0 57.0 57.0 56.0 58.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#10] stanford-crypto-aes Cycles:10 Average:83.90 Median:83.00 stddev:2.85 (3.4%) stddev-sans-first:3.00 08:29:45 INFO - PROCESS | 1692 | Values: 83.0 86.0 83.0 88.0 82.0 82.0 80.0 83.0 83.0 89.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#11] stanford-crypto-ccm Cycles:10 Average:142.90 Median:140.00 stddev:13.03 (9.3%) stddev-sans-first:13.78 08:29:45 INFO - PROCESS | 1692 | Values: 140.0 139.0 136.0 140.0 141.0 132.0 140.0 143.0 179.0 139.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:165.00 Median:165.50 stddev:1.76 (1.1%) stddev-sans-first:1.72 08:29:45 INFO - PROCESS | 1692 | Values: 167.0 165.0 162.0 167.0 167.0 163.0 164.0 164.0 165.0 166.0 08:29:45 INFO - PROCESS | 1692 | 08:29:45 INFO - PROCESS | 1692 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.50 Median:65.50 stddev:4.95 (7.6%) stddev-sans-first:5.17 08:29:45 INFO - PROCESS | 1692 | Values: 64.0 66.0 66.0 63.0 65.0 64.0 64.0 65.0 68.0 80.0 08:29:45 INFO - PROCESS | 1692 | -------- Summary: end -------- 08:29:45 INFO - PROCESS | 1692 | 08:29:46 INFO - TEST-INFO | 1692: exit 0 08:29:46 INFO - TEST-OK | kraken | took 60093ms 08:29:46 INFO - SUITE-END | took 1181s 08:29:46 INFO - Completed test suite (00:19:41) 08:29:46 INFO - javascript benchmark 08:29:46 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7692.088257146493, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3393.67760062794, 3420.469827176787, 3452.6374730653297, 3485.041613556272, 3489.180042689968, 6000.279966404027, 6027.095935609661, 6040.30536488304, 6053.757849686007, 6060.090986352044, 6029.457348838604, 6101.6033957792715, 6104.481119104881, 6115.388461153882, 6125.9387406125925, 5425.996190704723, 5448.700321482317, 5489.615726899118, 5491.862703432406, 5572.637778544382, 5356.812511562096, 5358.732063396815, 5401.4868587484125, 5532.889342213153, 5586.55307575393, 5432.75552600134, 5462.617616766828, 5464.453554644543, 5465.617406781527, 5468.7539060742365, 5434.402215756264, 5461.15352120422, 5462.590305727047, 5467.988422141897, 5472.945270547283, 5277.604179686539, 5392.0, 5405.540529055035, 5410.188471729232, 5424.945750542483, 5095.847124586268, 6070.635761854259, 6079.361667024988, 6088.4215999479975, 6092.603980741238, 6218.844528886769, 6228.87542249157, 6242.063690446424, 6250.624962502219, 6250.843728906768, 6297.338779428185, 6299.65351905645, 6305.4009869062365, 6448.903266451007, 6457.0637257597855, 6094.0, 6143.78496752616, 6149.354317796657, 6153.969230153865, 6154.415330543591, 6376.330485298977, 6667.933320666732, 6671.232808227019, 6672.466202703772, 6675.632840193787, 6168.167297414881, 6267.7806276781, 6278.0, 6294.590851594632, 6303.0, 6320.209973753281, 6426.3573642635365, 6441.774537891151, 6467.417932386108, 6525.086487891699, 6399.840003999937, 6401.263854656681, 6408.807735767934, 6416.069669897839, 6416.839579010562, 6425.903611445832, 6429.6463694496315, 6434.388733070351, 6434.613923164531, 6458.483321334282, 5071.695698258042, 5116.513931176532, 5155.200943853709, 5156.664816786897, 5169.431362550116, 4617.699849509839, 4622.6301895848255, 4624.12141693084, 4632.490426053131, 4634.397528321297, 5901.0558310670085, 5934.109883517421, 5935.881282374415, 5945.256842894638, 5950.375210602911, 5130.4105846340235, 6239.251289845248, 6254.874902501924, 6370.0763389308295, 6390.45681117101, 6068.302145253264, 6073.453389194905, 6075.696215189223, 6096.634201947809, 6099.634021958696, 5694.402087780723, 5696.0, 5710.885782284331, 5724.942750572524, 5724.942750572524, 6430.260520040161, 6448.903266451007, 6521.4130728232785, 6545.70544325516, 6548.705308261045, 6319.273283572448, 6326.367363263636, 6330.082138090043, 6346.936530634819, 6426.839329016812, 6668.899966500409, 6687.732490700512, 6693.832654183684, 6695.698693558899, 6695.698693558899, 6382.808515744535, 6382.840428989312, 6388.488920886225, 6399.328070552525, 6415.647139407378, 6264.624122552661, 6266.122742816101, 6474.935250647433, 6479.157709497924, 6479.287278399278, 6151.5386346025125, 6224.0, 6248.4688801452385, 6251.093591429309, 6254.030625253093, 6193.81418557444, 6224.097505861715, 6291.842703932438, 6319.96840015797, 6332.208473940757, 6210.285817131088, 6219.968900155471, 6233.812985610439, 6241.563090583615, 6253.906191407224, 6157.6613286269685, 6191.288001879841, 6290.0879372491645, 6293.716782744696, 6305.306416294296, 6146.323904370426, 6158.538109641884, 6198.535109866868, 6218.19163508741, 6229.906551401823], "value": 5917.757809031864, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [784.7371130671224, 818.0878320672452, 871.952042637655, 893.3166127912144, 896.0099090504996, 39123.41314880279, 39413.408798868004, 39464.01339966506, 39541.406878896836, 41944.58055419445, 40808.0, 41139.58860411395, 41141.794291028506, 41145.38281925766, 41456.0, 7314.963425182893, 7483.962580187119, 9085.863712044307, 9282.814343713122, 9290.489023103726, 7380.557166569996, 7470.1035875695, 7513.549187048795, 8877.733667989938, 11122.943320384551, 11101.611443599435, 11138.220324577283, 11183.49674264656, 11192.272502287366, 11211.439428028607, 11117.610883619116, 11132.220744547885, 11156.274842135235, 11160.720981975515, 11161.609343672932, 10889.183311251687, 10935.961083697037, 10939.83590246147, 10940.945295273552, 10967.780644387067, 39450.80274598637, 39500.01249968745, 39615.60384396148, 39770.801145994374, 39909.0, 3788.5643151037434, 3816.6183381661613, 3849.3456112460667, 3903.6486716195395, 3923.3526468132723, 27483.0, 29179.708202918122, 29265.56101658477, 29387.118386448226, 29430.558541621893, 2288.187693368847, 2764.903228387017, 3012.548117782328, 3091.0726781965323, 3092.087834088949, 242328.0, 266920.0, 269119.0, 354867.0, 356114.0, 42968.78515607402, 52462.0, 52620.473795262325, 52658.473415266126, 52720.0, 54528.45471545313, 54566.0, 54914.725426373414, 54916.72541637266, 54936.45063549393, 14726.558203253919, 14805.629859253604, 14819.481318153812, 14837.0, 14840.703185936221, 12570.308633025088, 12573.119881608383, 12587.622371328875, 12599.055070869537, 12607.180533265308, 10393.9480302598, 11412.42937853104, 12523.686907827196, 12553.937230313973, 12613.243205407705, 5363.892722145535, 5414.3232095988005, 5420.24116623673, 5422.864428389322, 5464.836054918359, 1116.6873275482878, 1131.9264247823864, 1133.0708818768696, 1159.1596092832797, 1195.6652137401368, 21698.457538561346, 26295.34261643436, 26458.0, 26626.866865665936, 26887.731122688914, 1231.5812623707982, 1238.4984081447028, 1242.6334231401759, 1283.6020833541631, 1291.6835375332917, 13613.795793063113, 13905.721885562232, 14512.637184070272, 14831.332590033475, 15016.399344026335, 485687.0, 488674.0, 488713.0, 488937.0, 489849.0, 40014.0, 49254.0, 49331.50668493341, 49370.50629493731, 49393.50606493961, 1381.3990913952464, 1432.2480697633616, 1439.0933711761522, 1439.7912302716256, 1442.3365251983996, 26695.733042669326, 27004.594931075655, 27417.31456713598, 27632.585511216945, 27778.86110569434, 40754.0, 40817.0, 40851.77444676664, 40884.0, 40959.38560921648, 378481.10759446025, 442098.0, 442343.0, 442685.0, 443484.0, 28904.42191156123, 29401.970931017313, 29498.410031798816, 29504.557431638113, 29515.81936722507, 36970.44544331783, 37739.0, 37776.81111594424, 37811.0, 37831.0, 28686.56970145491, 29443.411131777673, 30894.69105308918, 31044.379112418075, 32457.35085298328, 31267.905623303075, 31473.8426307867, 32065.19837004, 32086.0, 32430.0, 30699.539506906967, 31359.372812543166, 31716.682833172297, 31787.046388608378, 31835.20411989626, 26946.865265673547, 28514.714852852037, 28527.857360713064, 28697.569536457388, 29005.419891602472, 21723.661588304636, 21781.78218217861, 22066.8966551675, 22083.66874496916, 22095.889520552293], "value": 18342.69793025873, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [388.84446221511377, 405.84375015618997, 424.6730017886227, 428.51577717179595, 448.51112287606503, 14127.0, 20907.895460522694, 21764.564708705817, 21816.127354905824, 21962.560748785014, 21720.891395543, 22298.0, 22641.0, 22886.427839304026, 23025.654615180745, 6625.536212465129, 6719.697613607399, 6724.966375168117, 6735.326467353275, 6909.3090690931, 4216.135692183095, 6634.601923884558, 6772.119624448815, 6796.456283497333, 6807.217170025436, 4395.494518130424, 4401.119776044788, 4495.415595972519, 7828.295453409192, 7892.4869883457395, 7525.698972041167, 7708.460407771458, 7773.106092799316, 7794.688212471494, 7804.531728096275, 6607.669616519155, 7520.909468127091, 7583.0, 7584.4690871639, 7596.582187979659, 24432.633510497355, 27128.32179195516, 27432.451350973068, 28359.716402835915, 28734.425311493862, 2982.3587928595457, 2994.4609970205356, 2998.3253767902265, 3026.969730302713, 3034.7723920705816, 16335.673286534322, 16682.833171668248, 17010.744838827428, 17567.73648395275, 17713.38003169896, 2075.356639441778, 2116.714243577113, 2155.760437748301, 2156.795104465073, 2226.543558570489, 118203.0, 130118.0, 141627.2535471802, 157208.0, 170623.14688426603, 18462.81537184638, 23573.29280121599, 23692.170774022827, 24416.26751197467, 25694.357641059123, 28844.0, 44648.3302750459, 45313.773431132635, 45607.543924560996, 45696.54303456989, 10311.381317120997, 10494.527746251437, 10576.259661823598, 10604.469776511143, 10722.78554428907, 7306.4885458017425, 8885.733427997171, 8897.955510222537, 9068.727938161866, 9069.31980101495, 8498.0, 8819.55961968514, 9436.952815236018, 9587.274290627614, 9619.230461563058, 3349.069564131385, 3708.1841994761107, 3978.622030907059, 3982.6415622594104, 4023.657989070903, 897.7800438892513, 899.8875140607424, 904.9457032577935, 939.2251392601131, 949.5679465843025, 19762.0, 22416.32751017472, 22995.540089198457, 23023.19418820333, 23050.193243236743, 922.3405265235389, 926.1618235496886, 948.6252930092713, 952.8380175370204, 953.9046095390405, 11386.993545047815, 11875.584354547549, 12103.0, 12126.818097728365, 12131.696707582381, 654900.0, 717937.0, 780663.0, 789726.0, 806473.0, 123324.0, 166745.0, 167552.16223918804, 168696.0, 171637.0, 1208.256921992968, 1220.9084318676134, 1234.5432190089546, 1245.1284101129245, 1287.0025730059092, 20355.59288814245, 21554.245601403876, 21567.784322157204, 21591.568168636855, 21646.6752998702, 68029.63940721059, 68346.65826670834, 68511.0, 69457.0, 69512.0, 97764.0, 100230.0, 100320.99679003116, 100517.0, 100921.48617770593, 11251.268667536584, 11652.592159274385, 11844.348560829238, 11895.940520297343, 11932.28406295625, 13129.60611181666, 13286.20282783036, 13288.601341959757, 13635.977301702214, 13735.725285494435, 10540.0, 11362.261453005529, 11470.197086203885, 11607.883921160681, 11626.895444933056, 9864.210863131077, 10870.239083264096, 11470.254433461798, 11661.008814250883, 11823.349715765715, 11745.823812642646, 11816.40917954116, 11871.881281187078, 11895.583654572049, 11928.343941082976, 11619.5352185915, 11890.346030968034, 11918.284902905853, 12003.459844307201, 12015.459304331502, 11074.446277685922, 11407.657770266906, 11437.0, 11617.244879082833, 11635.0], "value": 11925.098319871437, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1517.5523220649907, 1530.09724262685, 1536.830948595655, 1558.773977773223, 1558.9454369097084, 10541.63104291349, 11094.334339939609, 11149.888501114987, 11172.994430501254, 11441.942790286057, 10962.397068161248, 11089.667309980714, 11097.889021109786, 11102.500387482563, 11103.666889993314, 2421.5399074175893, 2459.532688789124, 2460.520198561281, 2463.0763463701114, 2469.234537293436, 2390.7499566713745, 2428.8178386620984, 2435.9878200608973, 2436.1717016214484, 2441.2310122311505, 2392.820538459614, 2412.8190385721055, 2421.5641184586766, 2427.5994460914017, 2429.2712186344024, 2337.111897478947, 2365.1485465232504, 2367.4673198530363, 2371.6679664846934, 2377.2986968844234, 2317.7102862142233, 2340.0990618611786, 2372.9288121356385, 2384.3562238195764, 2386.820988425875, 10955.671329860117, 11031.503582338813, 11045.226834121615, 11059.889401105966, 11062.502187401586, 5737.254156959611, 5937.614055086406, 5940.613860099123, 5946.167536544887, 5960.761569537213, 3517.7009954153928, 3606.9098272543133, 3657.524521812174, 3683.28176005679, 3691.3909204981146, 1171.3674615707507, 1199.0707201918497, 1230.3848075962019, 1235.579902833032, 1256.704674401515, 13579.524716634969, 13760.31198440074, 13818.96357773171, 14122.082064665763, 14426.990110692255, 4066.674666026711, 4304.935425968613, 4394.099209662011, 4416.514183439819, 4429.712068715523, 11540.826887596693, 11696.70758231051, 11699.0, 11704.88295117055, 11708.473118709679, 5098.954714283563, 5899.646021238654, 5923.348431672513, 5923.585349025527, 5945.40545945402, 5034.244863270465, 5036.068327359377, 5130.819911420394, 5227.242049902743, 5381.811636592701, 3399.8810041648917, 3869.845206191777, 3919.2161567686576, 3964.286428442908, 4001.339778936443, 1055.9155267578728, 1056.1234175634206, 1061.697416236369, 1074.4466599701161, 1076.187478453778, 798.7084714079319, 837.7444879311746, 916.6322473414186, 928.4754113925745, 930.8417569013284, 6399.520035997319, 6415.615063096229, 6453.741850326029, 6503.414692677682, 6638.634875081821, 986.4525188520297, 997.9351342162736, 1008.5007921079113, 1009.1573536097294, 1021.6168936648756, 4060.4315395844606, 4071.4096456014304, 4132.718857154292, 4233.745975241495, 4263.317869140923, 12876.420561074774, 13043.804342934864, 13274.867251327556, 13642.727145457235, 13709.794353084711, 13185.604431866868, 13322.800157997637, 13555.932220338835, 13577.660558486117, 13590.0, 8644.740657780276, 8784.253338466175, 9729.4648794317, 10011.299209055442, 10048.246381521416, 6553.115329430466, 6589.703463344065, 6632.237292711207, 6740.090087838079, 6755.932440675727, 11930.164888457724, 12078.51685932553, 12170.14808963364, 12218.0, 12371.13402061847, 12180.208286461351, 12362.44369003379, 12527.060470464568, 12615.93692031534, 12689.87310126887, 9223.354365194373, 9225.677101301422, 9321.207697345802, 9332.486713230837, 9420.811583768424, 10182.134518565708, 10197.59209631636, 10306.12397946183, 10309.845352319871, 10311.742206444898, 9027.50348730826, 9058.411203271766, 9125.77185570366, 9196.08039196075, 9364.438133712, 8777.692780752643, 8845.0, 8903.287736980896, 8941.642334306815, 9031.954840225757, 6441.838954026, 7734.8839767402405, 7789.961050194939, 7870.212978702084, 7878.803029924297, 5851.180834683233, 5854.151148083589, 5940.702964851826, 5951.815778558451, 5958.9869722148205, 5359.973200133974, 5814.680192589279, 5869.882602348014, 5900.822975310747, 6045.153678485103], "value": 5104.435152693584, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [361.3964678986093, 378.1831244511855, 380.19398874386286, 382.40726873346307, 394.8420631747301, 4141.482314710661, 4803.783829727662, 4837.0, 4999.775010124544, 5149.974250128754, 4128.266128226145, 4346.370111208297, 4547.022390186109, 4973.0, 5019.723915184663, 4156.355764856452, 4195.28680124378, 4203.7687927164, 4220.514640816307, 4291.399204111412, 3439.850093691443, 3627.9320787151332, 4049.9392509112386, 4230.97884510577, 4290.249206388885, 4273.9358909616385, 4286.8854097934445, 4301.526832048487, 4308.956910430887, 4320.848770293024, 3324.650911654278, 4045.7167998240134, 4227.513835908879, 4259.212045771542, 4326.459192600925, 3368.932621347584, 3438.398280300962, 3582.5459560201343, 3637.618050104754, 3869.729118961674, 4209.663226941868, 4294.4202532658, 4915.361003069578, 4916.631252656065, 5021.447640759514, 4137.944824069873, 4191.140816132685, 4548.818047278105, 4900.558949694509, 5015.5736762375245, 5045.05765280366, 5373.81191658294, 5389.73051347435, 5481.479259470344, 5542.8337149885565, 4389.626881715058, 4395.230834603964, 4396.274614688573, 4406.955930440687, 4410.16206920684, 4979.45226025137, 5378.704171270579, 5535.280413546213, 5734.913976290359, 5902.0, 3813.4851795007876, 4406.471223453206, 4408.206522825923, 4429.75636339998, 4493.820247190141, 4166.0, 4404.713693609905, 4613.492515823256, 4613.792379342937, 4640.883977900512, 4693.718376897397, 4752.621739695519, 4818.349522814376, 4883.536064073907, 4926.556609905054, 4961.330220420269, 5101.540861322499, 5390.9191362129595, 5457.972710136424, 5479.958807826501, 1286.5239861251398, 1417.4471955937192, 1534.986908640292, 1536.7694845773224, 1556.6341909651223, 955.507913424573, 1017.5573625472942, 1091.4597274349248, 1172.9941350293363, 1174.2250114924109, 4721.905561888743, 4739.431268247832, 5037.672551284155, 5078.568321692697, 5102.540771330524, 4636.609017294798, 4909.459959404463, 5303.867403314871, 5541.556675465953, 5758.712064396764, 3903.9414408783323, 4499.707519011254, 4513.977430112894, 4701.717896926195, 4976.800927962841, 2627.6452678888104, 2818.746312831855, 2917.2852651100193, 2927.838968856691, 2940.617719696426, 5374.892502149935, 5599.776008959678, 5753.913691294634, 5862.882742345215, 5893.17311633395, 4453.726511014402, 5391.137418013178, 5679.858003549862, 5797.507211886952, 5868.530517558585, 5032.993401319677, 5335.146376579806, 5412.052890744104, 5681.857953551194, 5935.614185077956, 4087.5708050655444, 4950.232713929347, 5021.84934451967, 5316.0761581131, 5557.861053473695, 4877.561019508261, 5054.559450556574, 5464.907018596217, 5492.725363731717, 5511.779528818963, 5300.469953004823, 5560.972195138998, 5729.885402292014, 5784.94215057844, 5835.708214589169, 3973.841046358229, 4346.869593912188, 4389.341598760211, 4472.329150627302, 4523.185826551252, 4369.788205668894, 4898.608111351012, 5200.037992971313, 5383.981830434085, 5406.729663516887, 4883.658143929891, 5476.67139971603, 5482.80810171642, 5495.368032676133, 5509.724513774215, 4910.94414700841, 5523.7238138093735, 5533.0, 5541.5843811715085, 5542.8337149885565, 4476.865694029184, 4642.862498687843, 4843.789052736815, 5282.909497943746, 5364.544013758874, 4966.34300649151, 5216.504432078947, 5551.695351592453, 5563.385208951786, 5598.412166722435, 4906.95093049065, 5110.540051395392, 5287.836675931289, 5298.708571028476, 5504.366997795305], "value": 4120.356535266952, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [622.6450922973901, 745.3515441565838, 776.8912352270684, 820.7578764264541, 830.2983978538133, 15390.769138462918, 16113.677726445465, 16118.838811611895, 16195.595110122238, 16200.837991620081, 12351.444185011673, 14621.634459138528, 14643.707125857476, 14760.409583616669, 14783.630409239748, 949.8955114937369, 950.5152372290147, 968.4528241543541, 983.4640121133999, 984.9458279794609, 954.8710924025237, 964.7154089543601, 974.8440249560072, 974.9178411962715, 978.8433850583908, 1017.0795430135702, 1017.0897047142839, 1017.5675337981365, 1020.0054946427211, 1021.2289721260476, 1008.374807619277, 1009.152312057875, 1010.3836659637615, 1012.6000229909145, 1012.6658202793061, 756.1342263108764, 756.8334966307403, 759.4531937005347, 759.5632511305965, 760.4144808497481, 15954.840451595452, 16201.0, 16222.351105955748, 16425.425110121207, 16691.66616667672, 14029.64925876851, 14151.504697335544, 14258.429662813474, 14301.0, 14312.642183945485, 11207.551697932073, 11820.113491488173, 11858.525658973716, 11863.228890122115, 11885.405729713566, 3628.546431696038, 3640.6359364063383, 3697.9445308320396, 3771.6605505504363, 3867.671247943928, 49016.0, 76790.61604691941, 103621.0, 104022.47988760007, 109412.4529377356, 10695.78608427827, 10747.78504429907, 11008.39453830031, 11261.155413344031, 11324.886751132382, 22314.776852231593, 22317.55364892693, 22375.328740137822, 22375.664365034536, 22403.0, 7235.131784185932, 7715.4599178057, 7745.806354841174, 7885.487443316166, 8066.11272759996, 4250.468691413574, 4262.403263543107, 4317.546657600969, 4408.625266852289, 4496.123255965055, 3432.2105915639545, 3526.400511912981, 3529.505869178317, 3538.5399898013093, 3549.982250088785, 629.6883042893797, 659.9375006240045, 660.4056349285681, 660.5805313625882, 660.6663634864362, 675.321302091395, 688.5042769206264, 694.5103701890155, 706.4489698035541, 708.7200555780438, 9272.397294175857, 10254.948725256327, 10260.384376937407, 10318.638847640446, 10533.525991330409, 662.920449546048, 666.1872515531045, 695.7823808335413, 712.5404114346218, 717.6949796336536, 3938.8030598469963, 4387.358056062945, 4967.181833621382, 5054.848354549369, 5092.516210959953, 90486.0, 106465.4676726627, 108517.0, 109750.90249097567, 111030.0, 59665.10502342469, 62987.6850615744, 76995.46009079787, 79592.60203698944, 83009.0, 74262.88605670919, 74979.12552186238, 75162.24837751553, 75184.87222691774, 79299.20700792919, 10806.621768238074, 10938.562457501928, 11087.417927915316, 11208.887911120784, 11228.831567526657, 48264.7586762078, 50283.74290642763, 50335.24497132619, 51353.0, 53162.93674126419, 62937.0, 63185.47258109808, 63535.36464635479, 63935.68032159809, 64839.67580162069, 10132.392056476636, 12253.180674233206, 12416.81374779397, 12530.74938501243, 12880.935595322338, 12903.161294515827, 14173.787393188904, 14318.355673994487, 14738.852611474176, 14799.778003329744, 13204.471821127046, 13298.704394333028, 13372.06395552302, 13750.174989500661, 13795.931020344835, 12939.676508087374, 13492.59522214335, 13562.118462300314, 13597.660058498617, 13979.930100349433, 12631.557895473614, 13289.86710132925, 13443.798343024668, 13480.393382297623, 13667.19822436418, 11046.558137674403, 11154.330740155616, 11159.0, 11261.49323280438, 11295.548178072784, 11063.336199828036, 11069.54312705909, 11308.717282068013, 11319.547218111184, 11334.886651133384], "value": 7607.7881627272745, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1419.0000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 115.0, 115.0, 114.0, 115.0, 115.0, 114.0, 113.0, 114.0, 115.0], "value": 114.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 108.0, 109.0, 141.0, 109.0, 119.0, 105.0, 106.0, 118.0, 135.0], "value": 118.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [185.0, 185.0, 184.0, 182.0, 185.0, 185.0, 182.0, 184.0, 185.0, 185.0], "value": 184.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 60.0, 60.0, 95.0, 62.0, 61.0, 65.0, 58.0, 75.0, 60.0], "value": 67.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 67.0, 85.0, 95.0, 99.0, 97.0, 82.0, 67.0, 55.0, 80.0], "value": 81.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 89.0, 88.0, 87.0, 78.0, 88.0, 81.0, 121.0, 99.0, 87.0], "value": 90.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 95.0, 95.0, 96.0, 95.0, 96.0, 95.0, 96.0, 94.0], "value": 95.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 86.0, 83.0, 86.0, 83.0, 85.0, 86.0, 83.0, 84.0, 86.0], "value": 84.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 61.0, 60.0, 61.0, 66.0, 64.0, 63.0, 61.0, 65.0, 92.0], "value": 65.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 56.0, 65.0, 62.0, 59.0, 60.0, 57.0, 57.0, 56.0, 58.0], "value": 58.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 86.0, 83.0, 88.0, 82.0, 82.0, 80.0, 83.0, 83.0, 89.0], "value": 83.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [140.0, 139.0, 136.0, 140.0, 141.0, 132.0, 140.0, 143.0, 179.0, 139.0], "value": 142.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 165.0, 162.0, 167.0, 167.0, 163.0, 164.0, 164.0, 165.0, 166.0], "value": 165.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 66.0, 66.0, 63.0, 65.0, 64.0, 64.0, 65.0, 68.0, 80.0], "value": 66.5, "unit": "score"}]}]} 08:29:46 INFO - Return code: 0 08:29:46 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:29:46 ERROR - # TBPL SUCCESS # 08:29:46 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:29:46 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:29:46 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:29:46 INFO - 2017-03-12 08:29:46.663 screenresolution[1696:17790] starting screenresolution argv=screenresolution get 08:29:46 INFO - 2017-03-12 08:29:46.666 screenresolution[1696:17790] Display 0: 1600x1200x32@60 08:29:46 INFO - 2017-03-12 08:29:46.672 screenresolution[1697:17793] starting screenresolution argv=screenresolution list 08:29:46 INFO - Available Modes on Display 0 08:29:46 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:29:46 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:29:46 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:29:46 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:29:46 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:29:46 INFO - Intel Iris: 08:29:46 INFO - Chipset Model: Intel Iris 08:29:46 INFO - Type: GPU 08:29:46 INFO - Bus: Built-In 08:29:46 INFO - VRAM (Dynamic, Max): 1536 MB 08:29:46 INFO - Vendor: Intel (0x8086) 08:29:46 INFO - Device ID: 0x0a2e 08:29:46 INFO - Revision ID: 0x0009 08:29:46 INFO - Displays: 08:29:46 INFO - Display: 08:29:46 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:29:46 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:29:46 INFO - Display Serial Number: 1600x1200 60 08:29:46 INFO - Main Display: Yes 08:29:46 INFO - Mirror: Off 08:29:46 INFO - Online: Yes 08:29:46 INFO - Rotation: Supported 08:29:46 INFO - Return code: 0 08:29:46 INFO - Running post-action listener: _resource_record_post_action 08:29:46 INFO - [mozharness: 2017-03-12 15:29:46.910203Z] Finished run-tests step (success) 08:29:46 INFO - Running post-run listener: _resource_record_post_run 08:29:46 INFO - Total resource usage - Wall time: 1202s; CPU: 54.0%; Read bytes: 121996288; Write bytes: 526026752; Read time: 1777; Write time: 1993 08:29:46 INFO - TinderboxPrint: CPU usage
54.0% 08:29:46 INFO - TinderboxPrint: I/O read bytes / time
121,996,288 / 1,777 08:29:46 INFO - TinderboxPrint: I/O write bytes / time
526,026,752 / 1,993 08:29:46 INFO - TinderboxPrint: CPU idle
2,211.2 (46.0%) 08:29:46 INFO - TinderboxPrint: CPU system
961.8 (20.0%) 08:29:46 INFO - TinderboxPrint: CPU user
1,636.7 (34.0%) 08:29:46 INFO - TinderboxPrint: Swap in / out
237,502,464 / 0 08:29:46 INFO - install - Wall time: 20s; CPU: 54.0%; Read bytes: 206227968; Write bytes: 199561216; Read time: 15726; Write time: 423 08:29:46 INFO - run-tests - Wall time: 1182s; CPU: 54.0%; Read bytes: 119927808; Write bytes: 315430912; Read time: 1752; Write time: 1534 08:29:47 INFO - Running post-run listener: _upload_blobber_files 08:29:47 INFO - Blob upload gear active. 08:29:47 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:29:47 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:29:47 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:29:47 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:29:47 INFO - (blobuploader) - INFO - Open directory for files ... 08:29:47 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:29:47 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:29:47 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:29:48 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:29:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:29:48 INFO - (blobuploader) - INFO - Done attempting. 08:29:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:29:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:29:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:29:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:29:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:29:49 INFO - (blobuploader) - INFO - Done attempting. 08:29:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 08:29:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:29:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:29:50 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 08:29:50 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:29:50 INFO - (blobuploader) - INFO - Done attempting. 08:29:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:29:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:29:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:29:52 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:29:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:29:52 INFO - (blobuploader) - INFO - Done attempting. 08:29:52 INFO - (blobuploader) - INFO - Iteration through files over. 08:29:52 INFO - Return code: 0 08:29:52 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:29:52 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:29:52 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f1445f44c520df46f60bc32513c42bc2ab60fd328451414b5ab5e2c9ab8b4f3d0f794644f491b4ed5a99de0e7698e44da9fd4c69805aa4c24762d5b9641754db", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3fe49e5643e1f05f1107162bcba893a99550ea452a74d971dfd78a66c5c52d5700101a20aa6c5a8e41ba3856ae1c24143dca6b739e7808b0d6e1214bf8209ec7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ad25fb05201b9ef6a35d6d72000718faf7a2b668b5a8fb3db210623c2224cbf3186fa5cd923dbf1508e483526cf11c81163aae20dd6018a3d78b843a1e300a5d", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/8c8088fbd0e0439ebeb18bb01c7a968c14f215ceeb37d22ae25ceee49b338c02f9844de5f6d1c91b468c464aa17b21b8185eaef034e5fa0fb2612bd1501a1463"} 08:29:52 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:29:52 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:29:52 INFO - Contents: 08:29:52 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f1445f44c520df46f60bc32513c42bc2ab60fd328451414b5ab5e2c9ab8b4f3d0f794644f491b4ed5a99de0e7698e44da9fd4c69805aa4c24762d5b9641754db", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3fe49e5643e1f05f1107162bcba893a99550ea452a74d971dfd78a66c5c52d5700101a20aa6c5a8e41ba3856ae1c24143dca6b739e7808b0d6e1214bf8209ec7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ad25fb05201b9ef6a35d6d72000718faf7a2b668b5a8fb3db210623c2224cbf3186fa5cd923dbf1508e483526cf11c81163aae20dd6018a3d78b843a1e300a5d", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/8c8088fbd0e0439ebeb18bb01c7a968c14f215ceeb37d22ae25ceee49b338c02f9844de5f6d1c91b468c464aa17b21b8185eaef034e5fa0fb2612bd1501a1463"} 08:29:52 INFO - Running post-run listener: copy_logs_to_upload_dir 08:29:52 INFO - Copying logs to upload dir... 08:29:52 INFO - mkdir: /builds/slave/test/build/upload/logs 08:29:52 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1284.819081 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 24 secs) (at 2017-03-12 08:29:52.591728) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-12 08:29:52.595742) ========= 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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners TMPDIR=/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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/f1445f44c520df46f60bc32513c42bc2ab60fd328451414b5ab5e2c9ab8b4f3d0f794644f491b4ed5a99de0e7698e44da9fd4c69805aa4c24762d5b9641754db", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3fe49e5643e1f05f1107162bcba893a99550ea452a74d971dfd78a66c5c52d5700101a20aa6c5a8e41ba3856ae1c24143dca6b739e7808b0d6e1214bf8209ec7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ad25fb05201b9ef6a35d6d72000718faf7a2b668b5a8fb3db210623c2224cbf3186fa5cd923dbf1508e483526cf11c81163aae20dd6018a3d78b843a1e300a5d", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/8c8088fbd0e0439ebeb18bb01c7a968c14f215ceeb37d22ae25ceee49b338c02f9844de5f6d1c91b468c464aa17b21b8185eaef034e5fa0fb2612bd1501a1463"} build_url:https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011293 build_url: 'https://queue.taskcluster.net/v1/task/bnKQkXa2TrCIMTNeyszS8g/artifacts/public/build/firefox-54.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f1445f44c520df46f60bc32513c42bc2ab60fd328451414b5ab5e2c9ab8b4f3d0f794644f491b4ed5a99de0e7698e44da9fd4c69805aa4c24762d5b9641754db", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3fe49e5643e1f05f1107162bcba893a99550ea452a74d971dfd78a66c5c52d5700101a20aa6c5a8e41ba3856ae1c24143dca6b739e7808b0d6e1214bf8209ec7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ad25fb05201b9ef6a35d6d72000718faf7a2b668b5a8fb3db210623c2224cbf3186fa5cd923dbf1508e483526cf11c81163aae20dd6018a3d78b843a1e300a5d", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/8c8088fbd0e0439ebeb18bb01c7a968c14f215ceeb37d22ae25ceee49b338c02f9844de5f6d1c91b468c464aa17b21b8185eaef034e5fa0fb2612bd1501a1463"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-12 08:29:52.630514) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-12 08:29:52.630840) ========= 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.q4fAJ0MhsB/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.xgB4D2OI1t/Listeners TMPDIR=/var/folders/46/l2pgwt217d93gf4d7qtgkmq000000w/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.005422 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-12 08:29:52.679240) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-12 08:29:52.679581) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-12 08:29:52.679895) ========= ========= Total master_lag: 0.18 =========