builder: mozilla-aurora_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0060 starttime: 1482819259.78 results: success (0) buildid: 20161226195737 builduid: fde98cd84a6c47e3977d73872bcf3c6c revision: 5434909ba45c6df65a4e769ba80fe67ead95b785 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:19.783042) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:19.783485) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:19.783761) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:19.808637) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:19.809016) ========= 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.8XQzaul3nF/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.FAFDIpx2jY/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-12-26 22:14:19-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 35.5M=0s 2016-12-26 22:14:19 (35.5 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.109009 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:19.941391) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:19.941706) ========= 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.8XQzaul3nF/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.FAFDIpx2jY/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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.020234 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:19.990308) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-12-26 22:14:19.990675) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 5434909ba45c6df65a4e769ba80fe67ead95b785 --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 5434909ba45c6df65a4e769ba80fe67ead95b785 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.8XQzaul3nF/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.FAFDIpx2jY/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-12-26 22:14:20,072 truncating revision to first 12 chars 2016-12-26 22:14:20,072 Setting DEBUG logging. 2016-12-26 22:14:20,072 attempt 1/10 2016-12-26 22:14:20,072 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/5434909ba45c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-12-26 22:14:20,918 unpacking tar archive at: mozilla-aurora-5434909ba45c/testing/mozharness/ program finished with exit code 0 elapsedTime=1.087804 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-12-26 22:14:21.100301) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:21.103666) ========= script_repo_revision: 5434909ba45c6df65a4e769ba80fe67ead95b785 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:21.104049) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:21.104314) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-26 22:14:21.124268) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 11 secs) (at 2016-12-26 22:14:21.124652) ========= /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.8XQzaul3nF/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.FAFDIpx2jY/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:14:21 INFO - MultiFileLogger online at 20161226 22:14:21 in /builds/slave/test 22:14:21 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 22:14:21 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 22:14:21 INFO - {'append_to_log': False, 22:14:21 INFO - 'base_work_dir': '/builds/slave/test', 22:14:21 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 22:14:21 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 22:14:21 INFO - 'branch': 'Mozilla-Aurora', 22:14:21 INFO - 'buildbot_json_path': 'buildprops.json', 22:14:21 INFO - 'config_files': ('talos/mac_config.py',), 22:14:21 INFO - 'default_actions': ('clobber', 22:14:21 INFO - 'read-buildbot-config', 22:14:21 INFO - 'download-and-extract', 22:14:21 INFO - 'populate-webroot', 22:14:21 INFO - 'create-virtualenv', 22:14:21 INFO - 'install', 22:14:21 INFO - 'run-tests'), 22:14:21 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 22:14:21 INFO - 'download_minidump_stackwalk': True, 22:14:21 INFO - 'download_symbols': 'ondemand', 22:14:21 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 22:14:21 INFO - 'tooltool.py': '/tools/tooltool.py', 22:14:21 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 22:14:21 INFO - '/tools/misc-python/virtualenv.py')}, 22:14:21 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 22:14:21 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 22:14:21 INFO - 'installer_path': 'installer.exe', 22:14:21 INFO - 'log_level': 'info', 22:14:21 INFO - 'log_name': 'talos', 22:14:21 INFO - 'log_to_console': True, 22:14:21 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 22:14:21 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 22:14:21 INFO - 'opt_config_files': (), 22:14:21 INFO - 'pip_index': False, 22:14:21 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 22:14:21 INFO - 'cmd': ('bash', 22:14:21 INFO - '-c', 22:14:21 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 22:14:21 INFO - 'enabled': True, 22:14:21 INFO - 'halt_on_failure': False, 22:14:21 INFO - 'name': 'check_screen_resolution'},), 22:14:21 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 22:14:21 INFO - 'cmd': ('bash', 22:14:21 INFO - '-c', 22:14:21 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 22:14:21 INFO - 'enabled': True, 22:14:21 INFO - 'halt_on_failure': False, 22:14:21 INFO - 'name': 'check_screen_resolution'},), 22:14:21 INFO - 'run_cmd_checks_enabled': True, 22:14:21 INFO - 'sps_profile': False, 22:14:21 INFO - 'sps_profile_interval': 0, 22:14:21 INFO - 'suite': 'dromaeojs', 22:14:21 INFO - 'system_bits': '32', 22:14:21 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 22:14:21 INFO - 'title': 't-yosemite-r7-0060', 22:14:21 INFO - 'tooltool_cache': '/builds/tooltool_cache', 22:14:21 INFO - 'use_talos_json': True, 22:14:21 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 22:14:21 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 22:14:21 INFO - 'work_dir': 'build'} 22:14:21 INFO - [mozharness: 2016-12-27 06:14:21.321225Z] Running clobber step. 22:14:21 INFO - Running pre-action listener: _resource_record_pre_action 22:14:21 INFO - Running main action method: clobber 22:14:21 INFO - rmtree: /builds/slave/test/build 22:14:21 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 22:14:22 INFO - Running post-action listener: _resource_record_post_action 22:14:22 INFO - [mozharness: 2016-12-27 06:14:22.938561Z] Finished clobber step (success) 22:14:22 INFO - [mozharness: 2016-12-27 06:14:22.938766Z] Running read-buildbot-config step. 22:14:22 INFO - Running pre-action listener: _resource_record_pre_action 22:14:22 INFO - Running main action method: read_buildbot_config 22:14:22 INFO - Using buildbot properties: 22:14:22 INFO - { 22:14:22 INFO - "project": "", 22:14:22 INFO - "product": "firefox", 22:14:22 INFO - "script_repo_revision": "production", 22:14:22 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs", 22:14:22 INFO - "repository": "", 22:14:22 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs", 22:14:22 INFO - "buildid": "20161226195737", 22:14:22 INFO - "pgo_build": "False", 22:14:22 INFO - "basedir": "/builds/slave/test", 22:14:22 INFO - "buildnumber": 13, 22:14:22 INFO - "slavename": "t-yosemite-r7-0060", 22:14:22 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 22:14:22 INFO - "platform": "yosemite_r7", 22:14:22 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 22:14:22 INFO - "branch": "mozilla-aurora", 22:14:22 INFO - "repo_path": "releases/mozilla-aurora", 22:14:22 INFO - "revision": "5434909ba45c6df65a4e769ba80fe67ead95b785", 22:14:22 INFO - "stage_platform": "macosx64", 22:14:22 INFO - "builduid": "fde98cd84a6c47e3977d73872bcf3c6c", 22:14:22 INFO - "slavebuilddir": "test" 22:14:22 INFO - } 22:14:22 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.dmg. 22:14:22 INFO - Running post-action listener: _resource_record_post_action 22:14:22 INFO - [mozharness: 2016-12-27 06:14:22.942878Z] Finished read-buildbot-config step (success) 22:14:22 INFO - [mozharness: 2016-12-27 06:14:22.942997Z] Running download-and-extract step. 22:14:22 INFO - Running pre-action listener: _resource_record_pre_action 22:14:22 INFO - Running main action method: download_and_extract 22:14:22 INFO - mkdir: /builds/slave/test/build/tests 22:14:22 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')]} 22:14:22 INFO - trying https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.test_packages.json 22:14:22 INFO - Downloading https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-52.0a2.en-US.mac.test_packages.json 22:14:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.mac.test_packages.json'}, attempt #1 22:14:24 INFO - Downloaded 1199 bytes. 22:14:24 INFO - Reading from file /builds/slave/test/build/firefox-52.0a2.en-US.mac.test_packages.json 22:14:24 INFO - Using the following test package requirements: 22:14:24 INFO - {u'common': [u'firefox-52.0a2.en-US.mac.common.tests.zip'], 22:14:24 INFO - u'cppunittest': [u'firefox-52.0a2.en-US.mac.common.tests.zip', 22:14:24 INFO - u'firefox-52.0a2.en-US.mac.cppunittest.tests.zip'], 22:14:24 INFO - u'gtest': [u'firefox-52.0a2.en-US.mac.common.tests.zip', 22:14:24 INFO - u'firefox-52.0a2.en-US.mac.gtest.tests.zip'], 22:14:24 INFO - u'jittest': [u'firefox-52.0a2.en-US.mac.common.tests.zip', 22:14:24 INFO - u'jsshell-mac.zip'], 22:14:24 INFO - u'mochitest': [u'firefox-52.0a2.en-US.mac.common.tests.zip', 22:14:24 INFO - u'firefox-52.0a2.en-US.mac.mochitest.tests.zip'], 22:14:24 INFO - u'mozbase': [u'firefox-52.0a2.en-US.mac.common.tests.zip'], 22:14:24 INFO - u'reftest': [u'firefox-52.0a2.en-US.mac.common.tests.zip', 22:14:24 INFO - u'firefox-52.0a2.en-US.mac.reftest.tests.zip'], 22:14:24 INFO - u'talos': [u'firefox-52.0a2.en-US.mac.common.tests.zip', 22:14:24 INFO - u'firefox-52.0a2.en-US.mac.talos.tests.zip'], 22:14:24 INFO - u'web-platform': [u'firefox-52.0a2.en-US.mac.common.tests.zip', 22:14:24 INFO - u'firefox-52.0a2.en-US.mac.web-platform.tests.zip'], 22:14:24 INFO - u'xpcshell': [u'firefox-52.0a2.en-US.mac.common.tests.zip', 22:14:24 INFO - u'firefox-52.0a2.en-US.mac.xpcshell.tests.zip']} 22:14:24 INFO - Downloading packages: [u'firefox-52.0a2.en-US.mac.common.tests.zip'] for test suite category: common 22:14:24 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.common.tests.zip 22:14:24 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.common.tests.zip'}, attempt #1 22:14:24 INFO - Fetch https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.common.tests.zip into memory 22:14:24 INFO - Http code: 200 22:14:24 INFO - via: 1.1 1b52a5dd431f9e3c81753e61dfdf467a.cloudfront.net (CloudFront) 22:14:24 INFO - x-amz-cf-id: sFDjWLci-LVVDoMI8goKCuuZ2RmZqhBiB4H4u7MzDLSGsRrmTDtOxQ== 22:14:24 INFO - x-amz-version-id: bGxAaDR_1e85UJM35oIu02j1eWwtQtpQ 22:14:25 INFO - Expected file size: 16268410 22:14:25 INFO - Obtained file size: 16268410 22:14:32 INFO - Downloading packages: [u'firefox-52.0a2.en-US.mac.common.tests.zip', u'firefox-52.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 22:14:32 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.common.tests.zip 22:14:32 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.common.tests.zip'}, attempt #1 22:14:32 INFO - Fetch https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.common.tests.zip into memory 22:14:32 INFO - Http code: 200 22:14:32 INFO - via: 1.1 76bce8bb4fbd102fc0b3aa2e41094b79.cloudfront.net (CloudFront) 22:14:32 INFO - x-amz-cf-id: WB_1ik3mobbkOZrznUzy2pcieDGBO2d2rXe4AtKUhOEaKfC4R6tz9w== 22:14:32 INFO - x-amz-version-id: bGxAaDR_1e85UJM35oIu02j1eWwtQtpQ 22:14:32 INFO - Expected file size: 16268410 22:14:32 INFO - Obtained file size: 16268410 22:14:39 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.talos.tests.zip 22:14:39 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.talos.tests.zip'}, attempt #1 22:14:39 INFO - Fetch https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.talos.tests.zip into memory 22:14:40 INFO - Http code: 200 22:14:40 INFO - via: 1.1 0302e8c462515ae281b72d9c815a5698.cloudfront.net (CloudFront) 22:14:40 INFO - x-amz-cf-id: 2rKT73MlykVPqOr574_eOUQCu1EnUG4Q6bfvQVFvM8T-oLHElJ6AcQ== 22:14:40 INFO - x-amz-version-id: 4moWFdUDMm_6GGRi4RyyGUNXBDWjNm1O 22:14:40 INFO - Expected file size: 14409038 22:14:40 INFO - Obtained file size: 14409038 22:14:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:14:40 INFO - trying https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.dmg 22:14:40 INFO - Downloading https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-52.0a2.en-US.mac.dmg 22:14:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.mac.dmg'}, attempt #1 22:14:43 INFO - Downloaded 109826056 bytes. 22:14:43 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.dmg 22:14:43 INFO - mkdir: /builds/slave/test/properties 22:14:43 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 22:14:43 INFO - Writing to file /builds/slave/test/properties/build_url 22:14:43 INFO - Contents: 22:14:43 INFO - build_url:https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.dmg 22:14:44 INFO - Running post-action listener: _resource_record_post_action 22:14:44 INFO - Running post-action listener: set_extra_try_arguments 22:14:44 INFO - [mozharness: 2016-12-27 06:14:44.401527Z] Finished download-and-extract step (success) 22:14:44 INFO - [mozharness: 2016-12-27 06:14:44.401682Z] Running populate-webroot step. 22:14:44 INFO - Running pre-action listener: _resource_record_pre_action 22:14:44 INFO - Running main action method: populate_webroot 22:14:44 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 22:14:44 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 22:14:44 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 22:14:44 INFO - '--tppagecycles', 22:14:44 INFO - '7'], 22:14:44 INFO - 'tests': ['tsvgm']}}, 22:14:44 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['tresize', 'tcanvasmark']}, 22:14:44 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 22:14:44 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['dromaeo_css', 'kraken']}, 22:14:44 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 22:14:44 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:14:44 INFO - 'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 22:14:44 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:14:44 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 22:14:44 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:14:44 INFO - 'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['damp', 'tps']}, 22:14:44 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:14:44 INFO - 'tests': ['damp', 'tps']}, 22:14:44 INFO - 'g3': {'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['dromaeo_dom']}, 22:14:44 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 22:14:44 INFO - 'g4': {'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['basic_compositor_video']}, 22:14:44 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 22:14:44 INFO - 'other': {'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['a11yr', 22:14:44 INFO - 'ts_paint', 22:14:44 INFO - 'tpaint', 22:14:44 INFO - 'sessionrestore', 22:14:44 INFO - 'sessionrestore_no_auto_restore', 22:14:44 INFO - 'tabpaint']}, 22:14:44 INFO - 'other-e10s': {'tests': ['a11yr', 22:14:44 INFO - 'ts_paint', 22:14:44 INFO - 'tpaint', 22:14:44 INFO - 'sessionrestore', 22:14:44 INFO - 'sessionrestore_no_auto_restore', 22:14:44 INFO - 'tabpaint']}, 22:14:44 INFO - 'other-e10s_l64': {'tests': ['a11yr', 22:14:44 INFO - 'ts_paint', 22:14:44 INFO - 'tpaint', 22:14:44 INFO - 'sessionrestore', 22:14:44 INFO - 'sessionrestore_no_auto_restore', 22:14:44 INFO - 'tabpaint']}, 22:14:44 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 22:14:44 INFO - 'ts_paint', 22:14:44 INFO - 'tpaint', 22:14:44 INFO - 'sessionrestore', 22:14:44 INFO - 'sessionrestore_no_auto_restore', 22:14:44 INFO - 'tabpaint']}, 22:14:44 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['a11yr', 22:14:44 INFO - 'ts_paint', 22:14:44 INFO - 'tpaint', 22:14:44 INFO - 'sessionrestore', 22:14:44 INFO - 'sessionrestore_no_auto_restore', 22:14:44 INFO - 'tabpaint']}, 22:14:44 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['a11yr', 22:14:44 INFO - 'ts_paint', 22:14:44 INFO - 'tpaint', 22:14:44 INFO - 'sessionrestore', 22:14:44 INFO - 'sessionrestore_no_auto_restore', 22:14:44 INFO - 'tabpaint']}, 22:14:44 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['tsvgx', 22:14:44 INFO - 'tsvgr_opacity', 22:14:44 INFO - 'tart', 22:14:44 INFO - 'tscrollx', 22:14:44 INFO - 'cart']}, 22:14:44 INFO - 'svgr-e10s': {'tests': ['tsvgx', 22:14:44 INFO - 'tsvgr_opacity', 22:14:44 INFO - 'tart', 22:14:44 INFO - 'tscrollx', 22:14:44 INFO - 'cart']}, 22:14:44 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:14:44 INFO - 'talos_options': ['--disable-e10s'], 22:14:44 INFO - 'tests': ['tp5o']}, 22:14:44 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:14:44 INFO - 'tests': ['tp5o']}, 22:14:44 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:14:44 INFO - 'talos_options': ['--disable-e10s', 22:14:44 INFO - '--xperf_path', 22:14:44 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 22:14:44 INFO - 'tests': ['tp5n']}, 22:14:44 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:14:44 INFO - 'talos_options': ['--xperf_path', 22:14:44 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 22:14:44 INFO - 'tests': ['tp5n']}}, 22:14:44 INFO - 'talos.zip': {'path': '', 22:14:44 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 22:14:44 INFO - Running post-action listener: _resource_record_post_action 22:14:44 INFO - [mozharness: 2016-12-27 06:14:44.420857Z] Finished populate-webroot step (success) 22:14:44 INFO - [mozharness: 2016-12-27 06:14:44.420948Z] Running create-virtualenv step. 22:14:44 INFO - Running pre-action listener: _resource_record_pre_action 22:14:44 INFO - Running main action method: create_virtualenv 22:14:44 INFO - Creating virtualenv /builds/slave/test/build/venv 22:14:44 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 22:14:44 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 22:14:44 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 22:14:44 INFO - Using real prefix '/tools/python27' 22:14:44 INFO - New python executable in /builds/slave/test/build/venv/bin/python 22:14:45 INFO - Installing distribute.............................................................................................................................................................................................done. 22:14:48 INFO - Installing pip.................done. 22:14:48 INFO - Return code: 0 22:14:48 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 22:14:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 22:14:48 INFO - Reading from file tmpfile_stdout 22:14:48 INFO - Output received: 22:14:48 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) 22:14:48 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 22:14:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:14:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:14:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:14:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:14:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:14:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:14:48 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:14:48 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 22:14:48 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 22:14:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:14:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:14:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:14:48 INFO - 'HOME': '/Users/cltbld', 22:14:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:14:48 INFO - 'LOGNAME': 'cltbld', 22:14:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:14:48 INFO - 'MOZ_NO_REMOTE': '1', 22:14:48 INFO - 'NO_EM_RESTART': '1', 22:14:48 INFO - 'PAGER': '/bin/cat', 22:14:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:14:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:14:48 INFO - 'PWD': '/builds/slave/test', 22:14:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:14:48 INFO - 'SHELL': '/bin/bash', 22:14:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:14:48 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:14:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:14:48 INFO - 'USER': 'cltbld', 22:14:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:14:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:14:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:14:48 INFO - 'XPC_FLAGS': '0x0', 22:14:48 INFO - 'XPC_SERVICE_NAME': '0', 22:14:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:14:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:14:48 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 22:14:48 INFO - Cleaning up... 22:14:48 INFO - Return code: 0 22:14:48 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 22:14:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:14:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:14:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:14:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:14:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:14:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:14:48 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:14:48 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 22:14:48 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 22:14:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:14:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:14:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:14:48 INFO - 'HOME': '/Users/cltbld', 22:14:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:14:48 INFO - 'LOGNAME': 'cltbld', 22:14:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:14:48 INFO - 'MOZ_NO_REMOTE': '1', 22:14:48 INFO - 'NO_EM_RESTART': '1', 22:14:48 INFO - 'PAGER': '/bin/cat', 22:14:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:14:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:14:48 INFO - 'PWD': '/builds/slave/test', 22:14:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:14:48 INFO - 'SHELL': '/bin/bash', 22:14:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:14:48 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:14:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:14:48 INFO - 'USER': 'cltbld', 22:14:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:14:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:14:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:14:48 INFO - 'XPC_FLAGS': '0x0', 22:14:48 INFO - 'XPC_SERVICE_NAME': '0', 22:14:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:14:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:14:48 INFO - Downloading/unpacking psutil>=3.1.1 22:14:48 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 22:14:48 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 22:14:48 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 22:14:48 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 22:14:48 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 22:14:48 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 22:14:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 22:14:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 22:14:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 22:14:52 INFO - Installing collected packages: psutil 22:14:52 INFO - Running setup.py install for psutil 22:14:52 INFO - building 'psutil._psutil_osx' extension 22:14:52 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 22:14:52 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 22:14:52 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 22:14:52 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 22:14:52 INFO - building 'psutil._psutil_posix' extension 22:14:52 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 22:14:53 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 22:14:53 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 22:14:53 INFO - ^ 22:14:53 INFO - 1 warning generated. 22:14:53 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 22:14:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 22:14:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 22:14:53 INFO - Successfully installed psutil 22:14:53 INFO - Cleaning up... 22:14:53 INFO - Return code: 0 22:14:53 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 22:14:53 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')]} 22:14:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:14:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:14:53 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')]} 22:14:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:14:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:14:53 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:14:53 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 22:14:53 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 22:14:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:14:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:14:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:14:53 INFO - 'HOME': '/Users/cltbld', 22:14:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:14:53 INFO - 'LOGNAME': 'cltbld', 22:14:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:14:53 INFO - 'MOZ_NO_REMOTE': '1', 22:14:53 INFO - 'NO_EM_RESTART': '1', 22:14:53 INFO - 'PAGER': '/bin/cat', 22:14:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:14:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:14:53 INFO - 'PWD': '/builds/slave/test', 22:14:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:14:53 INFO - 'SHELL': '/bin/bash', 22:14:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:14:53 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:14:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:14:53 INFO - 'USER': 'cltbld', 22:14:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:14:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:14:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:14:53 INFO - 'XPC_FLAGS': '0x0', 22:14:53 INFO - 'XPC_SERVICE_NAME': '0', 22:14:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:14:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:14:53 INFO - Downloading/unpacking mozsystemmonitor==0.3 22:14:53 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 22:14:53 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 22:14:53 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 22:14:53 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 22:14:53 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 22:14:53 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 22:14:56 INFO - Downloading mozsystemmonitor-0.3.tar.gz 22:14:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 22:14:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 22:14:56 INFO - Installing collected packages: mozsystemmonitor 22:14:56 INFO - Running setup.py install for mozsystemmonitor 22:14:56 INFO - Successfully installed mozsystemmonitor 22:14:56 INFO - Cleaning up... 22:14:56 INFO - Return code: 0 22:14:56 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 22:14:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:14:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:14:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:14:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:14:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:14:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:14:56 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:14:56 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 22:14:56 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 22:14:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:14:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:14:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:14:56 INFO - 'HOME': '/Users/cltbld', 22:14:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:14:56 INFO - 'LOGNAME': 'cltbld', 22:14:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:14:56 INFO - 'MOZ_NO_REMOTE': '1', 22:14:56 INFO - 'NO_EM_RESTART': '1', 22:14:56 INFO - 'PAGER': '/bin/cat', 22:14:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:14:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:14:56 INFO - 'PWD': '/builds/slave/test', 22:14:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:14:56 INFO - 'SHELL': '/bin/bash', 22:14:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:14:56 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:14:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:14:56 INFO - 'USER': 'cltbld', 22:14:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:14:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:14:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:14:56 INFO - 'XPC_FLAGS': '0x0', 22:14:56 INFO - 'XPC_SERVICE_NAME': '0', 22:14:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:14:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:14:56 INFO - Downloading/unpacking jsonschema==2.5.1 22:14:56 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 22:14:56 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 22:14:56 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 22:14:56 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 22:14:56 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 22:14:56 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 22:14:59 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 22:14:59 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 22:14:59 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 22:14:59 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 22:14:59 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 22:14:59 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 22:14:59 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 22:14:59 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 22:14:59 INFO - Downloading functools32-3.2.3-2.tar.gz 22:14:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 22:14:59 INFO - warning: no files found matching '*.txt' 22:14:59 INFO - no previously-included directories found matching 'build' 22:14:59 INFO - no previously-included directories found matching 'dist' 22:14:59 INFO - no previously-included directories found matching '.git*' 22:14:59 INFO - Installing collected packages: jsonschema, functools32 22:15:00 INFO - Running setup.py install for functools32 22:15:00 INFO - warning: no files found matching '*.txt' 22:15:00 INFO - no previously-included directories found matching 'build' 22:15:00 INFO - no previously-included directories found matching 'dist' 22:15:00 INFO - no previously-included directories found matching '.git*' 22:15:00 INFO - Successfully installed jsonschema functools32 22:15:00 INFO - Cleaning up... 22:15:00 INFO - Return code: 0 22:15:00 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 22:15:00 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')]} 22:15:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:15:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:00 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')]} 22:15:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:15:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:00 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:15:00 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 22:15:00 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 22:15:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:15:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:15:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:15:00 INFO - 'HOME': '/Users/cltbld', 22:15:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:15:00 INFO - 'LOGNAME': 'cltbld', 22:15:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:15:00 INFO - 'MOZ_NO_REMOTE': '1', 22:15:00 INFO - 'NO_EM_RESTART': '1', 22:15:00 INFO - 'PAGER': '/bin/cat', 22:15:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:15:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:15:00 INFO - 'PWD': '/builds/slave/test', 22:15:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:15:00 INFO - 'SHELL': '/bin/bash', 22:15:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:15:00 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:15:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:15:00 INFO - 'USER': 'cltbld', 22:15:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:15:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:15:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:15:00 INFO - 'XPC_FLAGS': '0x0', 22:15:00 INFO - 'XPC_SERVICE_NAME': '0', 22:15:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:15:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:15:00 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 22:15:00 INFO - Cleaning up... 22:15:00 INFO - Return code: 0 22:15:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 22:15:00 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')]} 22:15:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:15:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:00 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')]} 22:15:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:15:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:00 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:15:00 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 22:15:00 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 22:15:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:15:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:15:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:15:00 INFO - 'HOME': '/Users/cltbld', 22:15:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:15:00 INFO - 'LOGNAME': 'cltbld', 22:15:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:15:00 INFO - 'MOZ_NO_REMOTE': '1', 22:15:00 INFO - 'NO_EM_RESTART': '1', 22:15:00 INFO - 'PAGER': '/bin/cat', 22:15:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:15:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:15:00 INFO - 'PWD': '/builds/slave/test', 22:15:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:15:00 INFO - 'SHELL': '/bin/bash', 22:15:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:15:00 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:15:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:15:00 INFO - 'USER': 'cltbld', 22:15:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:15:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:15:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:15:00 INFO - 'XPC_FLAGS': '0x0', 22:15:00 INFO - 'XPC_SERVICE_NAME': '0', 22:15:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:15:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:15:00 INFO - Downloading/unpacking blobuploader==1.2.4 22:15:00 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 22:15:00 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 22:15:00 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 22:15:00 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 22:15:00 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 22:15:00 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 22:15:03 INFO - Downloading blobuploader-1.2.4.tar.gz 22:15:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 22:15:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 22:15:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:15:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:15:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 22:15:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 22:15:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:15:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:15:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 22:15:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 22:15:04 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 22:15:04 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 22:15:04 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 22:15:04 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 22:15:04 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 22:15:04 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 22:15:04 INFO - Downloading docopt-0.6.1.tar.gz 22:15:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 22:15:04 INFO - Installing collected packages: blobuploader, requests, docopt 22:15:04 INFO - Running setup.py install for blobuploader 22:15:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 22:15:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 22:15:04 INFO - Running setup.py install for requests 22:15:05 INFO - Running setup.py install for docopt 22:15:05 INFO - Successfully installed blobuploader requests docopt 22:15:05 INFO - Cleaning up... 22:15:05 INFO - Return code: 0 22:15:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:15:05 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')]} 22:15:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:15:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:05 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')]} 22:15:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:15:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:05 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:15:05 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 22:15:05 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 22:15:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:15:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:15:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:15:05 INFO - 'HOME': '/Users/cltbld', 22:15:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:15:05 INFO - 'LOGNAME': 'cltbld', 22:15:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:15:05 INFO - 'MOZ_NO_REMOTE': '1', 22:15:05 INFO - 'NO_EM_RESTART': '1', 22:15:05 INFO - 'PAGER': '/bin/cat', 22:15:05 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:15:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:15:05 INFO - 'PWD': '/builds/slave/test', 22:15:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:15:05 INFO - 'SHELL': '/bin/bash', 22:15:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:15:05 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:15:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:15:05 INFO - 'USER': 'cltbld', 22:15:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:15:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:15:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:15:05 INFO - 'XPC_FLAGS': '0x0', 22:15:05 INFO - 'XPC_SERVICE_NAME': '0', 22:15:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:15:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:15:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 22:15:05 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-8c6bAe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-x8aXVE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-T4JMxd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-ZfPZdy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-NHEcFd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-5m3cDw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-8GvxuM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-8XWU5e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-goQ3HW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-ob1gCN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 22:15:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 22:15:06 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-6NLMBN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 22:15:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 22:15:07 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-QVQ8ob-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 22:15:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 22:15:07 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-D8jivt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 22:15:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 22:15:07 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-N5tkHI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 22:15:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 22:15:07 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-hsbEQh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 22:15:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 22:15:07 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-0EK8NU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 22:15:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 22:15:07 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-D4g89w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 22:15:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 22:15:07 INFO - Running setup.py install for manifestparser 22:15:07 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 22:15:07 INFO - Running setup.py install for mozcrash 22:15:07 INFO - Running setup.py install for mozdebug 22:15:08 INFO - Running setup.py install for mozdevice 22:15:08 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 22:15:08 INFO - Installing dm script to /builds/slave/test/build/venv/bin 22:15:08 INFO - Running setup.py install for mozfile 22:15:08 INFO - Running setup.py install for mozhttpd 22:15:08 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 22:15:08 INFO - Running setup.py install for mozinfo 22:15:08 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 22:15:08 INFO - Running setup.py install for mozInstall 22:15:08 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 22:15:08 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 22:15:08 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 22:15:08 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 22:15:08 INFO - Running setup.py install for mozleak 22:15:09 INFO - Running setup.py install for mozlog 22:15:09 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 22:15:09 INFO - Running setup.py install for moznetwork 22:15:09 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 22:15:09 INFO - Running setup.py install for mozprocess 22:15:09 INFO - Running setup.py install for mozprofile 22:15:09 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 22:15:09 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 22:15:09 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 22:15:09 INFO - Running setup.py install for mozrunner 22:15:09 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 22:15:09 INFO - Running setup.py install for mozscreenshot 22:15:09 INFO - Running setup.py install for moztest 22:15:10 INFO - Running setup.py install for mozversion 22:15:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 22:15:10 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 22:15:10 INFO - Cleaning up... 22:15:10 INFO - Return code: 0 22:15:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:15:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:15:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:15:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:15:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:15:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:10 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:15:10 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 22:15:10 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 22:15:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:15:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:15:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:15:10 INFO - 'HOME': '/Users/cltbld', 22:15:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:15:10 INFO - 'LOGNAME': 'cltbld', 22:15:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:15:10 INFO - 'MOZ_NO_REMOTE': '1', 22:15:10 INFO - 'NO_EM_RESTART': '1', 22:15:10 INFO - 'PAGER': '/bin/cat', 22:15:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:15:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:15:10 INFO - 'PWD': '/builds/slave/test', 22:15:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:15:10 INFO - 'SHELL': '/bin/bash', 22:15:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:15:10 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:15:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:15:10 INFO - 'USER': 'cltbld', 22:15:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:15:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:15:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:15:10 INFO - 'XPC_FLAGS': '0x0', 22:15:10 INFO - 'XPC_SERVICE_NAME': '0', 22:15:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:15:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:15:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 22:15:10 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-MIwcAe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-tbhllE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-asOocH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-SDZN1E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 22:15:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-c3tm0I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-Y2VD8x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-xjSJ25-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-9NNdhT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-2vv1po-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-rxlM48-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 22:15:11 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)) 22:15:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 22:15:11 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-wztClx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 22:15:12 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)) 22:15:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 22:15:12 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-fmT3oo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 22:15:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 22:15:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 22:15:12 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-TQk2Io-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 22:15:12 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)) 22:15:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 22:15:12 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-OXvyl0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 22:15:12 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)) 22:15:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 22:15:12 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-QedyVE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 22:15:12 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)) 22:15:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 22:15:12 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-sXERMS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 22:15:12 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 22:15:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 22:15:12 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-7yz9WB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 22:15:12 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)) 22:15:12 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)) 22:15:12 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)) 22:15:12 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)) 22:15:12 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 22:15:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 22:15:12 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 22:15:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:15:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:15:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 22:15:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 22:15:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:15:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:15:15 INFO - Downloading blessings-1.6.tar.gz 22:15:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 22:15:15 INFO - Installing collected packages: blessings 22:15:15 INFO - Running setup.py install for blessings 22:15:15 INFO - Successfully installed blessings 22:15:15 INFO - Cleaning up... 22:15:15 INFO - Return code: 0 22:15:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 22:15:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 22:15:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 22:15:16 INFO - Reading from file tmpfile_stdout 22:15:16 INFO - Current package versions: 22:15:16 INFO - blessings == 1.6 22:15:16 INFO - blobuploader == 1.2.4 22:15:16 INFO - docopt == 0.6.1 22:15:16 INFO - functools32 == 3.2.3-2 22:15:16 INFO - jsonschema == 2.5.1 22:15:16 INFO - manifestparser == 1.1 22:15:16 INFO - mozInstall == 1.12 22:15:16 INFO - mozcrash == 1.0 22:15:16 INFO - mozdebug == 0.1 22:15:16 INFO - mozdevice == 0.48 22:15:16 INFO - mozfile == 1.2 22:15:16 INFO - mozhttpd == 0.7 22:15:16 INFO - mozinfo == 0.9 22:15:16 INFO - mozleak == 0.1 22:15:16 INFO - mozlog == 3.4 22:15:16 INFO - moznetwork == 0.27 22:15:16 INFO - mozprocess == 0.23 22:15:16 INFO - mozprofile == 0.28 22:15:16 INFO - mozrunner == 6.13 22:15:16 INFO - mozscreenshot == 0.1 22:15:16 INFO - mozsystemmonitor == 0.3 22:15:16 INFO - moztest == 0.7 22:15:16 INFO - mozversion == 1.4 22:15:16 INFO - psutil == 3.1.1 22:15:16 INFO - requests == 1.2.3 22:15:16 INFO - wsgiref == 0.1.2 22:15:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:15:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:15:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:15:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:15:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:15:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:16 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:15:16 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 22:15:16 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 22:15:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:15:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:15:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:15:16 INFO - 'HOME': '/Users/cltbld', 22:15:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:15:16 INFO - 'LOGNAME': 'cltbld', 22:15:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:15:16 INFO - 'MOZ_NO_REMOTE': '1', 22:15:16 INFO - 'NO_EM_RESTART': '1', 22:15:16 INFO - 'PAGER': '/bin/cat', 22:15:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:15:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:15:16 INFO - 'PWD': '/builds/slave/test', 22:15:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:15:16 INFO - 'SHELL': '/bin/bash', 22:15:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:15:16 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:15:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:15:16 INFO - 'USER': 'cltbld', 22:15:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:15:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:15:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:15:16 INFO - 'XPC_FLAGS': '0x0', 22:15:16 INFO - 'XPC_SERVICE_NAME': '0', 22:15:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:15:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 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)) 22:15:16 INFO - Cleaning up... 22:15:16 INFO - Return code: 0 22:15:16 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 22:15:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:15:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:15:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:15:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:15:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:15:16 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 0x110421490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110397570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7feccb5a7840>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, '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.8XQzaul3nF/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.FAFDIpx2jY/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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 22:15:16 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 22:15:16 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 22:15:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:15:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:15:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:15:16 INFO - 'HOME': '/Users/cltbld', 22:15:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:15:16 INFO - 'LOGNAME': 'cltbld', 22:15:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:15:16 INFO - 'MOZ_NO_REMOTE': '1', 22:15:16 INFO - 'NO_EM_RESTART': '1', 22:15:16 INFO - 'PAGER': '/bin/cat', 22:15:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:15:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:15:16 INFO - 'PWD': '/builds/slave/test', 22:15:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:15:16 INFO - 'SHELL': '/bin/bash', 22:15:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:15:16 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:15:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:15:16 INFO - 'USER': 'cltbld', 22:15:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:15:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:15:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:15:16 INFO - 'XPC_FLAGS': '0x0', 22:15:16 INFO - 'XPC_SERVICE_NAME': '0', 22:15:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:15:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:15:16 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 22:15:16 INFO - Cleaning up... 22:15:16 INFO - Return code: 0 22:15:16 INFO - Running post-action listener: _resource_record_post_action 22:15:16 INFO - Running post-action listener: _start_resource_monitoring 22:15:16 INFO - Starting resource monitoring. 22:15:16 INFO - [mozharness: 2016-12-27 06:15:16.627232Z] Finished create-virtualenv step (success) 22:15:16 INFO - [mozharness: 2016-12-27 06:15:16.628295Z] Running install step. 22:15:16 INFO - Running pre-action listener: _resource_record_pre_action 22:15:16 INFO - Running main action method: install 22:15:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 22:15:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 22:15:16 INFO - Reading from file tmpfile_stdout 22:15:16 INFO - Detecting whether we're running mozinstall >=1.0... 22:15:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 22:15:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 22:15:16 INFO - Reading from file tmpfile_stdout 22:15:16 INFO - Output received: 22:15:16 INFO - Usage: mozinstall [options] installer 22:15:16 INFO - Options: 22:15:16 INFO - -h, --help show this help message and exit 22:15:16 INFO - -d DEST, --destination=DEST 22:15:16 INFO - Directory to install application into. [default: 22:15:16 INFO - "/builds/slave/test"] 22:15:16 INFO - --app=APP Application being installed. [default: firefox] 22:15:16 INFO - mkdir: /builds/slave/test/build/application 22:15:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 22:15:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 22:15:48 INFO - Reading from file tmpfile_stdout 22:15:48 INFO - Output received: 22:15:48 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 22:15:48 INFO - Running post-action listener: _resource_record_post_action 22:15:48 INFO - [mozharness: 2016-12-27 06:15:48.141807Z] Finished install step (success) 22:15:48 INFO - [mozharness: 2016-12-27 06:15:48.141976Z] Running run-tests step. 22:15:48 INFO - Running pre-action listener: _resource_record_pre_action 22:15:48 INFO - Running main action method: run_tests 22:15:48 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 22:15:48 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 22:15:48 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 22:15:48 INFO - 2016-12-26 22:15:48.156 screenresolution[2240:27957] starting screenresolution argv=screenresolution get 22:15:48 INFO - 2016-12-26 22:15:48.159 screenresolution[2240:27957] Display 0: 1600x1200x32@60 22:15:48 INFO - 2016-12-26 22:15:48.165 screenresolution[2241:27959] starting screenresolution argv=screenresolution list 22:15:48 INFO - Available Modes on Display 0 22:15:48 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 22:15:48 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 22:15:48 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 22:15:48 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 22:15:48 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 22:15:48 INFO - Intel Iris: 22:15:48 INFO - Chipset Model: Intel Iris 22:15:48 INFO - Type: GPU 22:15:48 INFO - Bus: Built-In 22:15:48 INFO - VRAM (Dynamic, Max): 1536 MB 22:15:48 INFO - Vendor: Intel (0x8086) 22:15:48 INFO - Device ID: 0x0a2e 22:15:48 INFO - Revision ID: 0x0009 22:15:48 INFO - Displays: 22:15:48 INFO - Display: 22:15:48 INFO - Resolution: 1600 x 1200 @ 60 Hz 22:15:48 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 22:15:48 INFO - Display Serial Number: 1600x1200 60 22:15:48 INFO - Main Display: Yes 22:15:48 INFO - Mirror: Off 22:15:48 INFO - Online: Yes 22:15:48 INFO - Rotation: Supported 22:15:48 INFO - Return code: 0 22:15:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 22:15:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 22:15:48 INFO - Python 2.7.3 22:15:48 INFO - Return code: 0 22:15:48 INFO - grabbing minidump binary from tooltool 22:15:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:15:48 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 0x110235d30>, '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 0x11009bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11022db20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 22:15:48 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 22:15:48 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 22:15:48 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 22:15:48 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 22:15:48 INFO - Return code: 0 22:15:48 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 22:15:48 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 22:15:48 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 22:15:48 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 22:15:48 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 22:15:48 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/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0060', '--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 22:15:48 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/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0060 --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 22:15:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.8XQzaul3nF/Render', 22:15:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:15:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:15:48 INFO - 'HOME': '/Users/cltbld', 22:15:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:15:48 INFO - 'LOGNAME': 'cltbld', 22:15:48 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 22:15:48 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 22:15:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:15:48 INFO - 'MOZ_NO_REMOTE': '1', 22:15:48 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 22:15:48 INFO - 'NO_EM_RESTART': '1', 22:15:48 INFO - 'PAGER': '/bin/cat', 22:15:48 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:15:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:15:48 INFO - 'PWD': '/builds/slave/test', 22:15:48 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 22:15:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:15:48 INFO - 'SHELL': '/bin/bash', 22:15:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.FAFDIpx2jY/Listeners', 22:15:48 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 22:15:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:15:48 INFO - 'USER': 'cltbld', 22:15:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:15:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:15:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:15:48 INFO - 'XPC_FLAGS': '0x0', 22:15:48 INFO - 'XPC_SERVICE_NAME': '0', 22:15:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:15:48 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/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0060', '--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 22:15:48 INFO - mozversion application_buildid: 20161226195737 22:15:48 INFO - mozversion application_changeset: 5434909ba45c6df65a4e769ba80fe67ead95b785 22:15:48 INFO - mozversion application_display_name: FirefoxDeveloperEdition 22:15:48 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 22:15:48 INFO - mozversion application_name: Firefox 22:15:48 INFO - mozversion application_remotingname: firefox-dev 22:15:48 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 22:15:48 INFO - mozversion application_vendor: Mozilla 22:15:48 INFO - mozversion application_version: 52.0a2 22:15:48 INFO - mozversion platform_buildid: 20161226195737 22:15:48 INFO - mozversion platform_changeset: 5434909ba45c6df65a4e769ba80fe67ead95b785 22:15:48 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 22:15:48 INFO - mozversion platform_version: 52.0a2 22:15:48 INFO - using testdate: 1482819348 22:15:48 INFO - actual date: 1482819348 22:15:48 INFO - starting webserver on 'localhost:56131' 22:15:48 INFO - SUITE-START | Running 2 tests 22:15:48 INFO - TEST-START | dromaeo_css 22:15:48 INFO - operating with platform_type : mac_ 22:15:48 INFO - Initialising browser for dromaeo_css test... 22:15:48 INFO - TEST-INFO | started process 2251 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/tmpuvdvcp/profile http://localhost:56131/getInfo.html) 22:15:51 INFO - PROCESS | 2251 | __metrics Screen width/height:1600/1200 22:15:51 INFO - PROCESS | 2251 | colorDepth:24 22:15:51 INFO - PROCESS | 2251 | Browser inner width/height: 1024/689 22:15:51 INFO - PROCESS | 2251 | __metrics 22:15:51 INFO - PROCESS | 2251 | 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" 22:15:51 INFO - PROCESS | 2251 | JavaScript error: resource:///modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 22:15:52 INFO - TEST-INFO | 2251: exit 0 22:15:52 INFO - Browser initialized. 22:15:52 INFO - Running cycle 1/1 for dromaeo_css test... 22:15:52 INFO - TEST-INFO | started process 2253 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/tmpuvdvcp/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 22:16:04 INFO - PROCESS | 2253 | RSS: Main: 222924800 22:16:04 INFO - PROCESS | 2253 | 22:16:55 INFO - PROCESS | 2253 | 1482819415874 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 22:19:09 INFO - PROCESS | 2253 | Cycle 1(1): loaded http://localhost:56131/tests/dromaeo/cssquery-dojo.html (next: http://localhost:56131/tests/dromaeo/cssquery-ext.html) 22:19:10 INFO - PROCESS | 2253 | RSS: Main: 353079296 22:19:10 INFO - PROCESS | 2253 | 22:22:13 INFO - PROCESS | 2253 | Cycle 1(1): loaded http://localhost:56131/tests/dromaeo/cssquery-ext.html (next: http://localhost:56131/tests/dromaeo/cssquery-jquery.html) 22:22:14 INFO - PROCESS | 2253 | RSS: Main: 345837568 22:22:14 INFO - PROCESS | 2253 | 22:25:16 INFO - PROCESS | 2253 | Cycle 1(1): loaded http://localhost:56131/tests/dromaeo/cssquery-jquery.html (next: http://localhost:56131/tests/dromaeo/cssquery-mootools.html) 22:25:16 INFO - PROCESS | 2253 | RSS: Main: 325918720 22:25:16 INFO - PROCESS | 2253 | 22:28:19 INFO - PROCESS | 2253 | Cycle 1(1): loaded http://localhost:56131/tests/dromaeo/cssquery-mootools.html (next: http://localhost:56131/tests/dromaeo/cssquery-prototype.html) 22:28:19 INFO - PROCESS | 2253 | RSS: Main: 320323584 22:28:19 INFO - PROCESS | 2253 | 22:31:23 INFO - PROCESS | 2253 | Cycle 1(1): loaded http://localhost:56131/tests/dromaeo/cssquery-prototype.html (next: http://localhost:56131/tests/dromaeo/cssquery-yui.html) 22:31:23 INFO - PROCESS | 2253 | RSS: Main: 306946048 22:31:23 INFO - PROCESS | 2253 | 22:34:26 INFO - PROCESS | 2253 | Cycle 1(1): loaded http://localhost:56131/tests/dromaeo/cssquery-yui.html (next: http://localhost:56131/tests/dromaeo/cssquery-dojo.html) 22:34:27 INFO - PROCESS | 2253 | RSS: Main: 544509952 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - PROCESS | 2253 | __start_tp_report 22:34:27 INFO - PROCESS | 2253 | _x_x_mozilla_page_load 22:34:27 INFO - PROCESS | 2253 | _x_x_mozilla_page_load_details 22:34:27 INFO - PROCESS | 2253 | |i|pagename|runs| 22:34:27 INFO - PROCESS | 2253 | |0;dojo.html;2735.630689856869;3279.7212236959863;3297.1097803593048;3309.3546758382126;3334.199792049909;5603.495685388314;5634.408387119355;5640.294963129609;5661.490465858077;5701.201831743554;5583.664980101197;5646.237757902682;5646.2942132233475;5673.801416950408;5719.628224165437;5157.948420515784;5158.43257241704;5173.275741396207;5185.144451165553;5212.661177023481;5141.331626888518;5168.689878607277;5195.298634684326;5297.841064768063;5349.251104845324;5182.455842136578;5207.869803254911;5239.738013099349;5239.895202095956;5249.711265880375;5219.63462557623;5290.60320475962;5312.371200572073;5317.388500322435;5345.705986170759;5023.346964894577;5160.5097515736325;5184.429712731597;5220.765065572021;5223.947760522384;5580.190872323531;5600.299962504687;5613.354464236583;5654.688992105433;5659.40576239493;6125.111858780452;6157.784477543264;6185.474234690057;6209.037599172136;6222.284437289724;6119.136988619962;6261.624302541862;6272.8118156455375;6284.87430251397;6285.9057114143325;5699.173619825144;5711.685857277889;5729.770809167587;5740.368559458456;5764.971175144097;6235.127082208494;6254.405831446005;6258.812235632939;6265.373462653698;6279.905801412982;5454.645448045864;6091.786787462506;6096.847578810476;6115.908261376083;6142.017277235621;4576.878664727164;6043.8489037773525;6084.574079814371;6130.29501607312;6171.1668924694595;6070.544709146831;6097.390260973867;6104.26748790148;6113.663748493786;6115.082737589397;5780.277465316835;6110.741024289823;6118.923762351576;6193.194884664965;6259.530535209878;4898.779554920037;4914.189158788831;4916.532929371704;4922.950770492249;4940.7035577865445;4394.231009573312;4422.292433210735;4436.511983681792;4462.933056004163;4467.463904331501;5514.117741161475;5578.63738856973;5586.972065139729;5587.832365028974;5686.886262274731;6201.6899155042065;6205.968970155121;6216.720247588869;6217.844553886189;6227.750889964351;5637.126245431965;5674.148877668383;5693.772249110072;5697.116946873241;5713.542916566665;5245.737713114329;5317.1492561190025;5320.627556071116;5370.3287089113865;5376.704281264568;6192;6212.47193988507;6245.5628106032145;6248.968755156195;6291.874162516632;6005.3694362091355;6191.071339299141;6206.968965155145;6228.501719862491;6228.906566401598;6226.688665566794;6245.344238854855;6264.248290205022;6277.717502712298;6306.243250809932;5958.433948774859;6027.849303767441;6053.303870055;6096.969515152573;6101.725422356093;6212.378762123752;6237.313895471404;6239.188905442264;6240.937590624036;6247.437730604267;5994.160817485468;6007.759689612367;6013.639181649115;6029.728662210124;6033.42682445167;5017.54842064216;5130.179171332569;5417.918731219113;5812.18629391877;5947.851303717442;5869.765209391748;5872.236609240771;5878.382769809279;5910.113482977587;5913.704314784158;5995.310539287863;5997.160397544434;6032.336442991355;6035.426634469718;6039.124326972476;5665.830025099089;5693.886122277614;5776.364599894092;5849.883002340014;5851.970740146442 22:34:27 INFO - PROCESS | 2253 | |1;ext.html;466.7456236351188;493.28473713115966;496.2704823908854;512.7615658718695;520.495119733858;30303.393932121344;34722.652773472255;39224.803875980615;40358.596414035885;40419.79790101053;36469.452958205584;38134.427983580266;41247.58752412475;41624;41680.58319416805;9223.861642075392;9351.812963740722;9375.95312023439;9388.765280867965;9413.670521531747;9233.353665243436;9323.860142097874;9419.48192849393;9431.81136377272;9446.197073248783;9380.906190938105;9448.24414046878;9451.905480945172;9455.338126331126;9463.101005404476;9352.392094513869;9420.952895235549;9427.387219830689;9430.811383772321;9446.52767361636;9304.813903721955;9321.254299656011;9381.812363752686;9391.859122113174;9413.811723765486;39028;39334.60665393338;39416.21167576661;39432.80283598592;39662.40506392407;3220.114468521152;3267.379197952381;3293.440115180425;3300.075978725961;3323.0861513084096;28517.144485665256;29266.85366573175;29493.101260803924;29552.817887284484;29656.851715741283;3160.1625569224175;3169.4611915974338;3192.5690031845634;3195.440797860365;3201.679832016803;414008;484237;491226.54386728193;492546;498020;58508;58966;59021.40978590245;59081.81836363249;59100.40899590949;35123.648763512036;36129.277414451564;61404.157875263816;61493.69253153705;61580.69209653923;15372.385104595915;15779.132147731985;15809.446669366516;15865.762013569805;15892.205389730467;11652.067834573214;12101.15291929574;12175.269483830998;12198.878011219951;12227.938860305641;18777;18819.435416937515;18823.058847057593;18857.90571047136;18894.24423023091;6658.800235992928;7692.384609231248;7702.9229707703325;7763.805904852424;7791.844163116706;828.5525816059381;984.522506584306;993.4287784523783;994.3785134291068;1017.9898201018043;28350.432991340058;29395;29410.970616028335;30111;30165.547516787265;659.7135585607988;889.8254304318237;1018.9898101018895;1049.0925349572565;1118.5190368141614;14615.26923653813;15412.229388530528;15832.208389580475;16349.937254078446;16359.754603680954;678545;683164;684921;685539;687335;56621.7168914161;57084;57095;57142.7142864283;57290.14064788948;1215.3133479584008;1257.6352857671172;1263.033779158944;1320.933953302331;1384.37011159924;29096;29409.85295073511;29871;30570.694293056786;30573;48136.518634813205;48946.818456801615;48959.26561101658;49052.75473622609;49217.50782492272;550148;555928;556469;556532;556690;23355.88322058379;26147.215583532525;27211.86394068017;27261.591076133478;27768.166954991382;43132.78433607812;44202.778986104866;44257.778711106235;44399.778001109786;44531;36674.633253667125;36756.632433675324;36961.44557831688;37164.81417593003;38058.61941380551;37305.81347093247;37597;37605.24789504249;39089.609103908595;39134.80432597933;36427;36906.8154659225;37156;37300.44049339208;37879.2424151521;32447.837760811046;33632.66367336393;34245.657543425245;34292.65707342895;34467.96596102121;25265.115720949678;25312.620310694987;25608.487830243663;25700.915890093307;25942.740572594786 22:34:27 INFO - PROCESS | 2253 | |2;jquery.html;353.52450953467576;371.30380536494073;378.55708820679786;379.30965642530595;404.2380113486078;14552.70894582109;14980.176090315028;15330.846691533081;19665.606687866235;20070.397888063344;17209.139543022862;19283.903580482078;19397.515062123417;20741.688874666856;20803.583928321423;5813.651180929158;5928.258967629046;6057.969710151443;6069.817905462821;6072.089186621998;4928.654994150411;5999.790007349744;6071.63570185788;6075.513958883279;6079;5725.942740572604;6020.367861374559;6024.487918526908;6024.759009639609;6044.486218671418;5851.561132915027;5945.286565612111;5947.86990471809;5949.167116603679;5968.283805943272;5031.06925218832;5155.71643559604;5186.97285596996;5194.11700010999;5215.322008138955;20370.5925881483;24421.14525991582;25174.496510069697;25430.237092887244;25743.742562574324;2341.274204996457;2490.476999830038;2758.6275852760023;2829.9434011319863;2957.438086763508;15494.302756375877;15615.9849609775;15847.524574262676;16126.38736126378;16269.51191464258;1812.2841477616269;1900.0879577802593;1900.9619807603908;1954.7556555430572;1957.9706304405445;114936.27595586074;118508;119801;120648;121882.39058804649;10657.253992220625;10862;10950.56197752081;11116.999470047735;11242.7189320266;13838.515651952133;13845.653858653613;13865.930670346785;13872.791908121386;13910.652233694238;8284;8584.227419532272;8609.139086091465;8725.869111963326;8742.825143497095;7635.961820190863;8157.3474122071275;8608.698695545625;8623.784405389915;8770.868436973451;6526.967365163238;6639.136912201479;6649.867002659919;6655.5341126121675;6662.133922590032;1815.9455216343267;1827.2873579304082;1832.15720768448;1832.395309547846;1833.7066069428827;402.91337362466624;403.8990252436891;846.2426128614856;1012.584840215508;1035.171862509989;11473.598424055284;11512.079033677286;11748.236364636443;11801.822972655416;12192.878071219351;389.2457249825418;409.59859337849076;419.7261311918313;435.47742708748996;448.55341523586173;5043.747812609355;6041.9395806041375;6063.060225665029;6192.164057852222;6199.814005579839;603518;609601;618251;624096;631862;81301;81926;124105;143020.5697943028;147981;894.8411806710326;961.6201600367956;974.181687382602;1006.5923301063082;1008.6772232885406;18018.90990545039;19269.614607707488;19611.901940490206;19652.803471965668;19737.605247894673;45511.54488455206;54636.72681636566;56343;57102;57591;82998;83795;84992;85398;86797.56601216954;7945.682172713258;7981.8802717958115;7990.920090799018;8152;8247.711330103417;10340.431276279876;12275.386230688608;12608.243505389706;12650.936745316583;12651.683707907376;10483.056524912794;10611.31026483276;10651.254412191072;10846.566137354417;11125.499352529318;10059.245556583432;10073;10658.14734821228;10726.785464290515;10805.459727013775;5805.3614102447855;10360.378377297386;10595.046445819913;10853.620123295646;11003.394813285346;7340.70637174507;7908.248716371935;8036.397270204641;8186.631601578062;8271.13153118938;7529.962350188214;7579.924200757921;7743.92256077432;7935.40484463656;8048.83902321962 22:34:27 INFO - PROCESS | 2253 | |3;mootools.html;1302.8241187439694;1456.2136446318984;1489.3595753825855;1639.5491239909024;1828.305244007278;7417.629118544071;7757.418193635479;8041.1154772975;8399.958000210007;8419.031811341698;8190.672373105083;8302.7960945663;8304.21109994551;8314.75055748327;8322.958385208065;2313.306008197538;2343.625019996801;2344.1443872986324;2346.765323467648;2346.8591884486987;2311.410590299471;2354.9529009419803;2360.598698221298;2361.740208577055;2365.8698771567642;2303.0557471436714;2308.3882771065682;2333.57995560799;2337.777911098443;2339.2163625185585;2262.1290803040783;2290.095412312144;2321.0831721469926;2329.9417514562188;2334.708161479815;2324.976750232493;2341.1922886604093;2349.3304408243566;2352.3413444235644;2361.5749165150264;8295.502269863828;8312.376571757142;8377.916220837775;8399.328053755686;8413.032501262373;4998.800047998076;5195.960807838447;5202.713850738208;5216.2958000669805;5221.373435187764;3309.271960168759;3485.1984043669845;3494.5806503219524;3538.0800991742076;3554.662307080823;951.457669128597;1027.147467601896;1048.2295512798087;1085.0885256384674;1099.763550836566;10864;10903.727406814814;10930;10940.3982780947;10948.562057517689;3775.4336849472797;4342.109867477159;4348.108637729258;4520.683552151384;4522.88692782683;7217.350438460564;8599;8640.179182977607;8658;8667.653293868174;5076.568491678248;5101.056304583664;5114.514121158484;5119.539241468286;5119.564836988898;4265.97867010663;4286.828526858891;4433.423654924839;4694.554017368345;4775;3656.122530592692;3659.158393569494;3686.668199862025;3765.548134223856;3786.1670432504807;1140.4183866228118;1149.5574203931546;1151.7984352738238;1162.7267592115845;1166.988330116705;779.3726050529265;785.2108630826098;887.4098724348365;896.2829736211005;898.793277546168;4031.286703151149;5348.732563371816;5509.146082357241;5781.971090144522;5885.558583106199;780.8360244348637;907.7095329494498;915.2037727177399;918.7106061590578;920.8848893888264;3811.2568049230135;3819.4461803038403;3819.866304679323;3829.5213098362706;3929.548101968253;9926.057024582653;10153.746156346151;10287.588496460057;10287.742806429898;10334.121599663962;10252.692419227435;10258.922813104666;10273;10278.33190842593;10284.691459256233;6763.425108865703;7457.552546847098;7835.764927052198;8066.475679080841;8068.47554908929;5690;5696.174054761954;5862;5903.439173278532;5923.526117910643;9157.816843663222;9361.906380936103;9421.764455888384;9476.384035037701;9557.761055973657;7567.697292108254;9637.132658060807;9658.71023869285;9732.318737688294;9766.267529935425;7225.24134965821;7335.77992660221;7398.926010739824;7405.111386633423;7405.333519983227;7716.614169291625;7826.099998500018;7919.2872641462545;7936.007999000125;7937.404694647809;6443.226812782496;6759.628220447923;7044.36600705939;7103.2541583133025;7295.635218239173;5985.461308482258;7001.439884809305;7010.929890701028;7016.263292354433;7021.227664956953;6539.444147247347;6570;6619.602823830585;6623.503237257129;6625.602463852184;4431.977840110779;4609.723416594881;4645.930311045269;4679.742614156118;4859.611231101433;4854.732989685601;4861.878453038702;4887.828925987574;4962.826301079445;5020.221865610836 22:34:27 INFO - PROCESS | 2253 | |4;prototype.html;306.14890604120546;306.57080087876983;312.0871451005808;318.0664748961797;321.23706197780274;5052.305694954182;5291.867703307415;5300.867478313039;5363.758630861611;5365.543928766059;4273.786310684469;4962.478939711333;5154.690718556889;5225.268462415265;5286.788528458857;3960.1089754805225;3986.4418981342637;4031.850922487092;4054.1486287879507;4078.632923036926;3536.504889315498;3539.92920141597;3815.313243616148;3924.666403355718;4095.8361665533344;3900.7659540427667;3974;4046.453728746611;4065.5934406559254;4127.979360103211;3455.4644030175364;4000.83975647062;4018.598140185987;4030.7380020298588;4106.3635136553885;3045.4061458015694;3454.0139419833445;3482.460218666111;3489.6335884731993;3511.719062474996;4219.894502637428;4248.4052232687445;5050.267711181895;5097.9490205097845;5199.856031673025;4009.558948515661;4492.393526873896;4578.00140907706;4627.506232794219;4646.837360692393;4798;5429.945700542983;5564.360098588673;5573.164025396182;5584.21820945068;3476.096214984097;3561.254985057329;3592.1141400764545;3818.694504439666;3863.8068096595057;4547.658440759984;5476.918770867045;5790.826275211708;5804.738786754606;5869.8239052828485;3293.3413317336626;3910.902227444337;3937.8031098444962;3944.4280579315837;3960.940585891214;3578.6063533011347;3776.3957766757185;4000.5599384067727;4011.7793521356607;4016.357382818793;3988.721952758387;4449.488308844459;4594.264917613166;4633.791479383436;4648.2562789953445;5549.72251387429;5572.749226284827;5576.33084029919;5584.329880414295;5617.9719101404235;1275.9409689957313;1288.4652869059423;1292.9030322725832;1297.156848048757;1304.9804252936215;797.4887588020785;805.5408417202256;835.8453686067975;857.4212406625503;858.579051669488;4819;4903.387076615423;5346.5455436287575;5346.97326513365;5354.04577329272;4887.3890763654545;5499;5573.888522229533;5770.480656740913;5786.334571524329;4979.551840334388;5191.6884986900905;5277.419483856773;5290.338707661543;5293.015119330251;2537.8731063446753;2635.1172357260534;2654.1904719060485;2857.914262572126;2862.8997985070423;4543.545645435496;4870.464248932614;5703.403047146806;5713.6857472838565;5735.856603584861;5274.604404669665;5555.388907220203;5780.046292361797;5963.105534169909;6028.125921741323;5533.612647114744;5587.6088673794075;5987.191729116514;6045.156227350701;6084.421979911901;5378.300820893259;5646.802361917477;5756.481916627524;5810.273715785527;5823.359430462561;5298.417174110922;5469.890602188014;5518.310211223597;5646.7458964347525;5739.852029594014;5435.619506634655;5802.970985145047;6024.789132380346;6033.728482218223;6072.8785424292155;3237.514372844092;3857.6528112470014;3895.4935858338235;3905.297046531538;3907.257621051991;5076.568491678101;5133.7689803958165;5398.541124004347;5542.972285138549;5827.650340979555;4758.000819827875;5182.756138526651;5407.405185429679;5530.170474428868;5743.942560574341;5304.416514183359;5612.943870561242;5619.269494965628;5656.85857853557;5719.399463056319;5247.658902171346;5490.423505532021;5523.861903452445;5543.784604929212;5563.443655634404;4442.333649952404;5423.457654234545;5507.705689163124;5555.66662001952;5662.688552129508;5479.835604931858;5485.4788795064405;5486.902619476041;5487.993764551979;5541 22:34:27 INFO - PROCESS | 2253 | |5;yui.html;661.3122352753137;674.7975607317804;702.2240424331114;714.0003994407829;767.986258139256;14086.084404513713;14261;14793.852061479382;14809;14811.629709257273;11448.771024579524;12586.307753073577;12876.742465150692;12992.54526091587;12997.610071697864;624.9187605611264;647.7052940911898;648.6756621689156;794.4557977785236;805.6535689653447;798.5168972771477;814.1207495904409;814.5235037503038;815.4903185509057;815.5555222403805;857.2284943550823;858.6007506509471;859.4886042804521;859.8409294280547;860.3203469259278;657.7566300468809;677.1434135818193;830.1117803949776;854.8204876975811;856.3106699107216;618.3044075415158;644.9322821103764;649.0556240669814;652.4682383857141;652.8172111808653;14087.295635218197;14138.50515231962;14138.85861141396;14141.151530908179;14143.717125657533;12724.936375318157;12977.480900763958;13028.21984498751;13167.60497185086;13198.538051168163;10426.843597346045;10764;10894.18293627973;11152.553897844076;11367.715807104805;4373.978130109329;4386.056997745468;4389.225266271036;4468.977655111737;4571.58855702985;84763.57618211869;85237.14762852354;86043;86295;89612.55193724055;8535.402521823537;10282.434466104436;10498.947505262577;10555.84166237507;10810.945945270223;19981.400557983285;20061.899690501454;20255.392338229878;20308.289209877585;20414.89792551028;7556.395488360918;7613.08642962848;7633.847323053508;7798.805029874298;7860.842783144305;4052.0754230010994;4061.939070913939;4069.4709687740406;4155.854545090968;4300.741955482681;3300.2409445827593;3388.593368795711;3389.1527118220447;3400.6769356911054;3405.880794172192;629.5844742469948;645.7449307523596;655.3250152343094;656.3928366261284;658.6969993802809;516.770037333383;574.3395095640047;618.5422787137486;630.8990811034682;655.6262930129875;8445.381931601101;8792.78018049541;8900.777480563038;8954.686585969459;8985.46087234768;623.9251289845157;637.3085202555279;646.7251418147268;650.2879347114902;672.579637726421;4343.435353404037;4408.977955110204;4423.225935461282;4458.8439404620685;4538.72767633943;78766.81849772258;78938;103343.44984825233;107109.92890071;111358.88641113647;63086.68456657687;101236.98763012423;102558.48720756348;102975;104371.4781426088;68331.65834170797;87844;87998;90811;91198;8439.493630382196;8552.059273480038;8625.69810056645;8664.263537599123;8866.645334186818;53702.92594148017;54520.90958180893;54967;55466;56900.71549642391;57852.13221801761;62677;76803.61598191973;80042.19957800348;82884;10774.299670521392;11129.499172537093;11720.945114939695;11869.690360233766;12013;13019.934900325437;13304.866951330363;14236;14306.213158276394;14858.108513489226;12467.750644986869;12889.419976100911;12985.675358116123;13278.601641950758;13779.379927903068;12488.62930284578;12633.620991370273;13192.538261160813;13231.073824832169;13277.535286264934;12211.389430528616;12417.130800843854;12667.113302069136;13129.868701312864;13404.396802144121;10143.340682855885;11095.445227738743;11337.603183888525;11456.94271528637;11857.822132668189;9583;9978.60085596568;10998.890011099787;11389.544418223179;11424 22:34:27 INFO - PROCESS | 2253 | __end_tp_report 22:34:27 INFO - PROCESS | 2253 | __start_cc_report 22:34:27 INFO - PROCESS | 2253 | _x_x_mozilla_cycle_collect,1450 22:34:27 INFO - PROCESS | 2253 | __end_cc_report 22:34:27 INFO - PROCESS | 2253 | __startTimestamp1482820467036__endTimestamp 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - PROCESS | 2253 | ------- Summary: start ------- 22:34:27 INFO - PROCESS | 2253 | Number of tests: 6 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - PROCESS | 2253 | [#0] dojo.html Cycles:165 Average:5662.96 Median:5776.36 stddev:642.56 (11.1%) stddev-sans-first:602.10 22:34:27 INFO - PROCESS | 2253 | Values: 2735.6 3279.7 3297.1 3309.4 3334.2 5603.5 5634.4 5640.3 5661.5 5701.2 5583.7 5646.2 5646.3 5673.8 5719.6 5157.9 5158.4 5173.3 5185.1 5212.7 5141.3 5168.7 5195.3 5297.8 5349.3 5182.5 5207.9 5239.7 5239.9 5249.7 5219.6 5290.6 5312.4 5317.4 5345.7 5023.3 5160.5 5184.4 5220.8 5223.9 5580.2 5600.3 5613.4 5654.7 5659.4 6125.1 6157.8 6185.5 6209.0 6222.3 6119.1 6261.6 6272.8 6284.9 6285.9 5699.2 5711.7 5729.8 5740.4 5765.0 6235.1 6254.4 6258.8 6265.4 6279.9 5454.6 6091.8 6096.8 6115.9 6142.0 4576.9 6043.8 6084.6 6130.3 6171.2 6070.5 6097.4 6104.3 6113.7 6115.1 5780.3 6110.7 6118.9 6193.2 6259.5 4898.8 4914.2 4916.5 4923.0 4940.7 4394.2 4422.3 4436.5 4462.9 4467.5 5514.1 5578.6 5587.0 5587.8 5686.9 6201.7 6206.0 6216.7 6217.8 6227.8 5637.1 5674.1 5693.8 5697.1 5713.5 5245.7 5317.1 5320.6 5370.3 5376.7 6192.0 6212.5 6245.6 6249.0 6291.9 6005.4 6191.1 6207.0 6228.5 6228.9 6226.7 6245.3 6264.2 6277.7 6306.2 5958.4 6027.8 6053.3 6097.0 6101.7 6212.4 6237.3 6239.2 6240.9 6247.4 5994.2 6007.8 6013.6 6029.7 6033.4 5017.5 5130.2 5417.9 5812.2 5947.9 5869.8 5872.2 5878.4 5910.1 5913.7 5995.3 5997.2 6032.3 6035.4 6039.1 5665.8 5693.9 5776.4 5849.9 5852.0 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - PROCESS | 2253 | [#1] ext.html Cycles:180 Average:69588.34 Median:39179.80 stddev:154845.03 (395.2%) stddev-sans-first:155192.44 22:34:27 INFO - PROCESS | 2253 | Values: 466.7 493.3 496.3 512.8 520.5 30303.4 34722.7 39224.8 40358.6 40419.8 36469.5 38134.4 41247.6 41624.0 41680.6 9223.9 9351.8 9376.0 9388.8 9413.7 9233.4 9323.9 9419.5 9431.8 9446.2 9380.9 9448.2 9451.9 9455.3 9463.1 9352.4 9421.0 9427.4 9430.8 9446.5 9304.8 9321.3 9381.8 9391.9 9413.8 39028.0 39334.6 39416.2 39432.8 39662.4 3220.1 3267.4 3293.4 3300.1 3323.1 28517.1 29266.9 29493.1 29552.8 29656.9 3160.2 3169.5 3192.6 3195.4 3201.7 414008.0 484237.0 491226.5 492546.0 498020.0 58508.0 58966.0 59021.4 59081.8 59100.4 35123.6 36129.3 61404.2 61493.7 61580.7 15372.4 15779.1 15809.4 15865.8 15892.2 11652.1 12101.2 12175.3 12198.9 12227.9 18777.0 18819.4 18823.1 18857.9 18894.2 6658.8 7692.4 7702.9 7763.8 7791.8 828.6 984.5 993.4 994.4 1018.0 28350.4 29395.0 29411.0 30111.0 30165.5 659.7 889.8 1019.0 1049.1 1118.5 14615.3 15412.2 15832.2 16349.9 16359.8 678545.0 683164.0 684921.0 685539.0 687335.0 56621.7 57084.0 57095.0 57142.7 57290.1 1215.3 1257.6 1263.0 1320.9 1384.4 29096.0 29409.9 29871.0 30570.7 30573.0 48136.5 48946.8 48959.3 49052.8 49217.5 550148.0 555928.0 556469.0 556532.0 556690.0 23355.9 26147.2 27211.9 27261.6 27768.2 43132.8 44202.8 44257.8 44399.8 44531.0 36674.6 36756.6 36961.4 37164.8 38058.6 37305.8 37597.0 37605.2 39089.6 39134.8 36427.0 36906.8 37156.0 37300.4 37879.2 32447.8 33632.7 34245.7 34292.7 34468.0 25265.1 25312.6 25608.5 25700.9 25942.7 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - PROCESS | 2253 | [#2] jquery.html Cycles:180 Average:34937.66 Median:396.08 stddev:102945.39 (25991.1%) stddev-sans-first:103201.42 22:34:27 INFO - PROCESS | 2253 | Values: 353.5 371.3 378.6 379.3 404.2 14552.7 14980.2 15330.8 19665.6 20070.4 17209.1 19283.9 19397.5 20741.7 20803.6 5813.7 5928.3 6058.0 6069.8 6072.1 4928.7 5999.8 6071.6 6075.5 6079.0 5725.9 6020.4 6024.5 6024.8 6044.5 5851.6 5945.3 5947.9 5949.2 5968.3 5031.1 5155.7 5187.0 5194.1 5215.3 20370.6 24421.1 25174.5 25430.2 25743.7 2341.3 2490.5 2758.6 2829.9 2957.4 15494.3 15616.0 15847.5 16126.4 16269.5 1812.3 1900.1 1901.0 1954.8 1958.0 114936.3 118508.0 119801.0 120648.0 121882.4 10657.3 10862.0 10950.6 11117.0 11242.7 13838.5 13845.7 13865.9 13872.8 13910.7 8284.0 8584.2 8609.1 8725.9 8742.8 7636.0 8157.3 8608.7 8623.8 8770.9 6527.0 6639.1 6649.9 6655.5 6662.1 1815.9 1827.3 1832.2 1832.4 1833.7 402.9 403.9 846.2 1012.6 1035.2 11473.6 11512.1 11748.2 11801.8 12192.9 389.2 409.6 419.7 435.5 448.6 5043.7 6041.9 6063.1 6192.2 6199.8 603518.0 609601.0 618251.0 624096.0 631862.0 81301.0 81926.0 124105.0 143020.6 147981.0 894.8 961.6 974.2 1006.6 1008.7 18018.9 19269.6 19611.9 19652.8 19737.6 45511.5 54636.7 56343.0 57102.0 57591.0 82998.0 83795.0 84992.0 85398.0 86797.6 7945.7 7981.9 7990.9 8152.0 8247.7 10340.4 12275.4 12608.2 12650.9 12651.7 10483.1 10611.3 10651.3 10846.6 11125.5 10059.2 10073.0 10658.1 10726.8 10805.5 5805.4 10360.4 10595.0 10853.6 11003.4 7340.7 7908.2 8036.4 8186.6 8271.1 7530.0 7579.9 7743.9 7935.4 8048.8 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - PROCESS | 2253 | [#3] mootools.html Cycles:180 Average:5394.00 Median:5088.81 stddev:2970.74 (58.4%) stddev-sans-first:2963.16 22:34:27 INFO - PROCESS | 2253 | Values: 1302.8 1456.2 1489.4 1639.5 1828.3 7417.6 7757.4 8041.1 8400.0 8419.0 8190.7 8302.8 8304.2 8314.8 8323.0 2313.3 2343.6 2344.1 2346.8 2346.9 2311.4 2355.0 2360.6 2361.7 2365.9 2303.1 2308.4 2333.6 2337.8 2339.2 2262.1 2290.1 2321.1 2329.9 2334.7 2325.0 2341.2 2349.3 2352.3 2361.6 8295.5 8312.4 8377.9 8399.3 8413.0 4998.8 5196.0 5202.7 5216.3 5221.4 3309.3 3485.2 3494.6 3538.1 3554.7 951.5 1027.1 1048.2 1085.1 1099.8 10864.0 10903.7 10930.0 10940.4 10948.6 3775.4 4342.1 4348.1 4520.7 4522.9 7217.4 8599.0 8640.2 8658.0 8667.7 5076.6 5101.1 5114.5 5119.5 5119.6 4266.0 4286.8 4433.4 4694.6 4775.0 3656.1 3659.2 3686.7 3765.5 3786.2 1140.4 1149.6 1151.8 1162.7 1167.0 779.4 785.2 887.4 896.3 898.8 4031.3 5348.7 5509.1 5782.0 5885.6 780.8 907.7 915.2 918.7 920.9 3811.3 3819.4 3819.9 3829.5 3929.5 9926.1 10153.7 10287.6 10287.7 10334.1 10252.7 10258.9 10273.0 10278.3 10284.7 6763.4 7457.6 7835.8 8066.5 8068.5 5690.0 5696.2 5862.0 5903.4 5923.5 9157.8 9361.9 9421.8 9476.4 9557.8 7567.7 9637.1 9658.7 9732.3 9766.3 7225.2 7335.8 7398.9 7405.1 7405.3 7716.6 7826.1 7919.3 7936.0 7937.4 6443.2 6759.6 7044.4 7103.3 7295.6 5985.5 7001.4 7010.9 7016.3 7021.2 6539.4 6570.0 6619.6 6623.5 6625.6 4432.0 4609.7 4645.9 4679.7 4859.6 4854.7 4861.9 4887.8 4962.8 5020.2 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - PROCESS | 2253 | [#4] prototype.html Cycles:180 Average:4506.94 Median:5187.22 stddev:1405.73 (27.1%) stddev-sans-first:1373.86 22:34:27 INFO - PROCESS | 2253 | Values: 306.1 306.6 312.1 318.1 321.2 5052.3 5291.9 5300.9 5363.8 5365.5 4273.8 4962.5 5154.7 5225.3 5286.8 3960.1 3986.4 4031.9 4054.1 4078.6 3536.5 3539.9 3815.3 3924.7 4095.8 3900.8 3974.0 4046.5 4065.6 4128.0 3455.5 4000.8 4018.6 4030.7 4106.4 3045.4 3454.0 3482.5 3489.6 3511.7 4219.9 4248.4 5050.3 5097.9 5199.9 4009.6 4492.4 4578.0 4627.5 4646.8 4798.0 5429.9 5564.4 5573.2 5584.2 3476.1 3561.3 3592.1 3818.7 3863.8 4547.7 5476.9 5790.8 5804.7 5869.8 3293.3 3910.9 3937.8 3944.4 3960.9 3578.6 3776.4 4000.6 4011.8 4016.4 3988.7 4449.5 4594.3 4633.8 4648.3 5549.7 5572.7 5576.3 5584.3 5618.0 1275.9 1288.5 1292.9 1297.2 1305.0 797.5 805.5 835.8 857.4 858.6 4819.0 4903.4 5346.5 5347.0 5354.0 4887.4 5499.0 5573.9 5770.5 5786.3 4979.6 5191.7 5277.4 5290.3 5293.0 2537.9 2635.1 2654.2 2857.9 2862.9 4543.5 4870.5 5703.4 5713.7 5735.9 5274.6 5555.4 5780.0 5963.1 6028.1 5533.6 5587.6 5987.2 6045.2 6084.4 5378.3 5646.8 5756.5 5810.3 5823.4 5298.4 5469.9 5518.3 5646.7 5739.9 5435.6 5803.0 6024.8 6033.7 6072.9 3237.5 3857.7 3895.5 3905.3 3907.3 5076.6 5133.8 5398.5 5543.0 5827.7 4758.0 5182.8 5407.4 5530.2 5743.9 5304.4 5612.9 5619.3 5656.9 5719.4 5247.7 5490.4 5523.9 5543.8 5563.4 4442.3 5423.5 5507.7 5555.7 5662.7 5479.8 5485.5 5486.9 5488.0 5541.0 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - PROCESS | 2253 | [#5] yui.html Cycles:180 Average:19975.05 Median:4463.91 stddev:29015.65 (650.0%) stddev-sans-first:29060.81 22:34:27 INFO - PROCESS | 2253 | Values: 661.3 674.8 702.2 714.0 768.0 14086.1 14261.0 14793.9 14809.0 14811.6 11448.8 12586.3 12876.7 12992.5 12997.6 624.9 647.7 648.7 794.5 805.7 798.5 814.1 814.5 815.5 815.6 857.2 858.6 859.5 859.8 860.3 657.8 677.1 830.1 854.8 856.3 618.3 644.9 649.1 652.5 652.8 14087.3 14138.5 14138.9 14141.2 14143.7 12724.9 12977.5 13028.2 13167.6 13198.5 10426.8 10764.0 10894.2 11152.6 11367.7 4374.0 4386.1 4389.2 4469.0 4571.6 84763.6 85237.1 86043.0 86295.0 89612.6 8535.4 10282.4 10498.9 10555.8 10810.9 19981.4 20061.9 20255.4 20308.3 20414.9 7556.4 7613.1 7633.8 7798.8 7860.8 4052.1 4061.9 4069.5 4155.9 4300.7 3300.2 3388.6 3389.2 3400.7 3405.9 629.6 645.7 655.3 656.4 658.7 516.8 574.3 618.5 630.9 655.6 8445.4 8792.8 8900.8 8954.7 8985.5 623.9 637.3 646.7 650.3 672.6 4343.4 4409.0 4423.2 4458.8 4538.7 78766.8 78938.0 103343.4 107109.9 111358.9 63086.7 101237.0 102558.5 102975.0 104371.5 68331.7 87844.0 87998.0 90811.0 91198.0 8439.5 8552.1 8625.7 8664.3 8866.6 53702.9 54520.9 54967.0 55466.0 56900.7 57852.1 62677.0 76803.6 80042.2 82884.0 10774.3 11129.5 11720.9 11869.7 12013.0 13019.9 13304.9 14236.0 14306.2 14858.1 12467.8 12889.4 12985.7 13278.6 13779.4 12488.6 12633.6 13192.5 13231.1 13277.5 12211.4 12417.1 12667.1 13129.9 13404.4 10143.3 11095.4 11337.6 11456.9 11857.8 9583.0 9978.6 10998.9 11389.5 11424.0 22:34:27 INFO - PROCESS | 2253 | -------- Summary: end -------- 22:34:27 INFO - PROCESS | 2253 | 22:34:27 INFO - TEST-INFO | 2253: exit 0 22:34:27 INFO - TEST-OK | dromaeo_css | took 1118967ms 22:34:27 INFO - TEST-START | kraken 22:34:27 INFO - operating with platform_type : mac_ 22:34:27 INFO - Initialising browser for kraken test... 22:34:27 INFO - TEST-INFO | started process 2257 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/tmpbcF425/profile http://localhost:56131/getInfo.html) 22:34:30 INFO - PROCESS | 2257 | __metrics Screen width/height:1600/1200 22:34:30 INFO - PROCESS | 2257 | colorDepth:24 22:34:30 INFO - PROCESS | 2257 | Browser inner width/height: 1024/689 22:34:30 INFO - PROCESS | 2257 | __metrics 22:34:30 INFO - PROCESS | 2257 | 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" 22:34:30 INFO - PROCESS | 2257 | JavaScript error: resource:///modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 22:34:31 INFO - TEST-INFO | 2257: exit 0 22:34:31 INFO - Browser initialized. 22:34:31 INFO - Running cycle 1/1 for kraken test... 22:34:31 INFO - TEST-INFO | started process 2258 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/tmpbcF425/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 22:34:43 INFO - PROCESS | 2258 | RSS: Main: 223342592 22:34:43 INFO - PROCESS | 2258 | 22:34:46 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:56131/tests/kraken/driver.html?testName=audio-beat-detection) 22:34:47 INFO - PROCESS | 2258 | RSS: Main: 271269888 22:34:47 INFO - PROCESS | 2258 | 22:34:49 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:56131/tests/kraken/driver.html?testName=audio-dft) 22:34:50 INFO - PROCESS | 2258 | RSS: Main: 284930048 22:34:50 INFO - PROCESS | 2258 | 22:34:53 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:56131/tests/kraken/driver.html?testName=audio-fft) 22:34:54 INFO - PROCESS | 2258 | RSS: Main: 383447040 22:34:54 INFO - PROCESS | 2258 | 22:34:56 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:56131/tests/kraken/driver.html?testName=audio-oscillator) 22:34:56 INFO - PROCESS | 2258 | RSS: Main: 284188672 22:34:56 INFO - PROCESS | 2258 | 22:34:58 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:56131/tests/kraken/driver.html?testName=imaging-gaussian-blur) 22:34:59 INFO - PROCESS | 2258 | RSS: Main: 285376512 22:34:59 INFO - PROCESS | 2258 | 22:35:02 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:56131/tests/kraken/driver.html?testName=imaging-darkroom) 22:35:02 INFO - PROCESS | 2258 | RSS: Main: 327368704 22:35:02 INFO - PROCESS | 2258 | 22:35:05 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:56131/tests/kraken/driver.html?testName=imaging-desaturate) 22:35:06 INFO - PROCESS | 2258 | RSS: Main: 326823936 22:35:06 INFO - PROCESS | 2258 | 22:35:09 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:56131/tests/kraken/driver.html?testName=json-parse-financial) 22:35:09 INFO - PROCESS | 2258 | RSS: Main: 326311936 22:35:09 INFO - PROCESS | 2258 | 22:35:11 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:56131/tests/kraken/driver.html?testName=json-stringify-tinderbox) 22:35:11 INFO - PROCESS | 2258 | RSS: Main: 301424640 22:35:11 INFO - PROCESS | 2258 | 22:35:13 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:56131/tests/kraken/driver.html?testName=stanford-crypto-aes) 22:35:14 INFO - PROCESS | 2258 | RSS: Main: 302579712 22:35:14 INFO - PROCESS | 2258 | 22:35:16 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:56131/tests/kraken/driver.html?testName=stanford-crypto-ccm) 22:35:17 INFO - PROCESS | 2258 | RSS: Main: 304111616 22:35:17 INFO - PROCESS | 2258 | 22:35:20 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:56131/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 22:35:20 INFO - PROCESS | 2258 | RSS: Main: 315863040 22:35:20 INFO - PROCESS | 2258 | 22:35:23 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:56131/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 22:35:24 INFO - PROCESS | 2258 | RSS: Main: 315637760 22:35:24 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | Cycle 1(1): loaded http://localhost:56131/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:56131/tests/kraken/driver.html?testName=ai-astar) 22:35:26 INFO - PROCESS | 2258 | RSS: Main: 359563264 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | __start_tp_report 22:35:26 INFO - PROCESS | 2258 | _x_x_mozilla_page_load 22:35:26 INFO - PROCESS | 2258 | _x_x_mozilla_page_load_details 22:35:26 INFO - PROCESS | 2258 | |i|pagename|runs| 22:35:26 INFO - PROCESS | 2258 | |0;ai-astar;103;115;115;112;114;114;112;112;115;117 22:35:26 INFO - PROCESS | 2258 | |1;audio-beat-detection;145;111;110;147;110;111;110;107;135;108 22:35:26 INFO - PROCESS | 2258 | |2;audio-dft;186;188;184;187;186;184;184;185;184;184 22:35:26 INFO - PROCESS | 2258 | |3;audio-fft;82;62;59;91;64;58;59;60;82;57 22:35:26 INFO - PROCESS | 2258 | |4;audio-oscillator;86;67;94;69;68;70;90;72;68;93 22:35:26 INFO - PROCESS | 2258 | |5;imaging-gaussian-blur;87;84;87;84;89;129;132;84;86;84 22:35:26 INFO - PROCESS | 2258 | |6;imaging-darkroom;93;93;93;93;93;93;93;93;119;107 22:35:26 INFO - PROCESS | 2258 | |7;imaging-desaturate;85;122;80;83;93;82;83;83;81;81 22:35:26 INFO - PROCESS | 2258 | |8;json-parse-financial;55;55;56;57;58;58;60;59;56;57 22:35:26 INFO - PROCESS | 2258 | |9;json-stringify-tinderbox;70;83;72;73;72;68;70;69;70;71 22:35:26 INFO - PROCESS | 2258 | |10;stanford-crypto-aes;83;85;83;83;82;83;84;84;82;83 22:35:26 INFO - PROCESS | 2258 | |11;stanford-crypto-ccm;147;149;149;139;140;145;162;150;189;175 22:35:26 INFO - PROCESS | 2258 | |12;stanford-crypto-pbkdf2;166;164;165;163;165;164;163;162;175;227 22:35:26 INFO - PROCESS | 2258 | |13;stanford-crypto-sha256-iterative;67;67;68;68;66;67;66;64;68;64 22:35:26 INFO - PROCESS | 2258 | __end_tp_report 22:35:26 INFO - PROCESS | 2258 | __start_cc_report 22:35:26 INFO - PROCESS | 2258 | _x_x_mozilla_cycle_collect,2021 22:35:26 INFO - PROCESS | 2258 | __end_cc_report 22:35:26 INFO - PROCESS | 2258 | __startTimestamp1482820526420__endTimestamp 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | ------- Summary: start ------- 22:35:26 INFO - PROCESS | 2258 | Number of tests: 14 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#0] ai-astar Cycles:10 Average:112.90 Median:114.50 stddev:3.84 (3.4%) stddev-sans-first:1.73 22:35:26 INFO - PROCESS | 2258 | Values: 103.0 115.0 115.0 112.0 114.0 114.0 112.0 112.0 115.0 117.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#1] audio-beat-detection Cycles:10 Average:119.40 Median:111.00 stddev:16.16 (14.6%) stddev-sans-first:14.24 22:35:26 INFO - PROCESS | 2258 | Values: 145.0 111.0 110.0 147.0 110.0 111.0 110.0 107.0 135.0 108.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#2] audio-dft Cycles:10 Average:185.20 Median:185.50 stddev:1.48 (0.8%) stddev-sans-first:1.54 22:35:26 INFO - PROCESS | 2258 | Values: 186.0 188.0 184.0 187.0 186.0 184.0 184.0 185.0 184.0 184.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#3] audio-fft Cycles:10 Average:67.40 Median:63.00 stddev:12.55 (19.9%) stddev-sans-first:12.14 22:35:26 INFO - PROCESS | 2258 | Values: 82.0 62.0 59.0 91.0 64.0 58.0 59.0 60.0 82.0 57.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#4] audio-oscillator Cycles:10 Average:77.70 Median:79.00 stddev:11.50 (14.6%) stddev-sans-first:11.80 22:35:26 INFO - PROCESS | 2258 | Values: 86.0 67.0 94.0 69.0 68.0 70.0 90.0 72.0 68.0 93.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#5] imaging-gaussian-blur Cycles:10 Average:94.60 Median:85.00 stddev:19.01 (22.4%) stddev-sans-first:19.96 22:35:26 INFO - PROCESS | 2258 | Values: 87.0 84.0 87.0 84.0 89.0 129.0 132.0 84.0 86.0 84.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#6] imaging-darkroom Cycles:10 Average:97.00 Median:93.00 stddev:8.89 (9.6%) stddev-sans-first:9.32 22:35:26 INFO - PROCESS | 2258 | Values: 93.0 93.0 93.0 93.0 93.0 93.0 93.0 93.0 119.0 107.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#7] imaging-desaturate Cycles:10 Average:87.30 Median:83.00 stddev:12.73 (15.3%) stddev-sans-first:13.47 22:35:26 INFO - PROCESS | 2258 | Values: 85.0 122.0 80.0 83.0 93.0 82.0 83.0 83.0 81.0 81.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#8] json-parse-financial Cycles:10 Average:57.10 Median:57.50 stddev:1.66 (2.9%) stddev-sans-first:1.58 22:35:26 INFO - PROCESS | 2258 | Values: 55.0 55.0 56.0 57.0 58.0 58.0 60.0 59.0 56.0 57.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#9] json-stringify-tinderbox Cycles:10 Average:71.80 Median:71.50 stddev:4.21 (5.9%) stddev-sans-first:4.42 22:35:26 INFO - PROCESS | 2258 | Values: 70.0 83.0 72.0 73.0 72.0 68.0 70.0 69.0 70.0 71.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#10] stanford-crypto-aes Cycles:10 Average:83.20 Median:83.00 stddev:0.92 (1.1%) stddev-sans-first:0.97 22:35:26 INFO - PROCESS | 2258 | Values: 83.0 85.0 83.0 83.0 82.0 83.0 84.0 84.0 82.0 83.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#11] stanford-crypto-ccm Cycles:10 Average:154.50 Median:149.50 stddev:16.14 (10.8%) stddev-sans-first:16.89 22:35:26 INFO - PROCESS | 2258 | Values: 147.0 149.0 149.0 139.0 140.0 145.0 162.0 150.0 189.0 175.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.40 Median:165.00 stddev:19.87 (12.0%) stddev-sans-first:20.98 22:35:26 INFO - PROCESS | 2258 | Values: 166.0 164.0 165.0 163.0 165.0 164.0 163.0 162.0 175.0 227.0 22:35:26 INFO - PROCESS | 2258 | 22:35:26 INFO - PROCESS | 2258 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.50 Median:67.00 stddev:1.51 (2.3%) stddev-sans-first:1.59 22:35:26 INFO - PROCESS | 2258 | Values: 67.0 67.0 68.0 68.0 66.0 67.0 66.0 64.0 68.0 64.0 22:35:26 INFO - PROCESS | 2258 | -------- Summary: end -------- 22:35:26 INFO - PROCESS | 2258 | 22:35:27 INFO - TEST-INFO | 2258: exit 0 22:35:27 INFO - TEST-OK | kraken | took 59795ms 22:35:27 INFO - SUITE-END | took 1178s 22:35:27 INFO - Completed test suite (00:19:38) 22:35:27 INFO - javascript benchmark 22:35:27 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2735.630689856869, 3279.7212236959863, 3297.1097803593048, 3309.3546758382126, 3334.199792049909, 5603.495685388314, 5634.408387119355, 5640.294963129609, 5661.490465858077, 5701.201831743554, 5583.664980101197, 5646.237757902682, 5646.2942132233475, 5673.801416950408, 5719.628224165437, 5157.948420515784, 5158.43257241704, 5173.275741396207, 5185.144451165553, 5212.661177023481, 5141.331626888518, 5168.689878607277, 5195.298634684326, 5297.841064768063, 5349.251104845324, 5182.455842136578, 5207.869803254911, 5239.738013099349, 5239.895202095956, 5249.711265880375, 5219.63462557623, 5290.60320475962, 5312.371200572073, 5317.388500322435, 5345.705986170759, 5023.346964894577, 5160.5097515736325, 5184.429712731597, 5220.765065572021, 5223.947760522384, 5580.190872323531, 5600.299962504687, 5613.354464236583, 5654.688992105433, 5659.40576239493, 6125.111858780452, 6157.784477543264, 6185.474234690057, 6209.037599172136, 6222.284437289724, 6119.136988619962, 6261.624302541862, 6272.8118156455375, 6284.87430251397, 6285.9057114143325, 5699.173619825144, 5711.685857277889, 5729.770809167587, 5740.368559458456, 5764.971175144097, 6235.127082208494, 6254.405831446005, 6258.812235632939, 6265.373462653698, 6279.905801412982, 5454.645448045864, 6091.786787462506, 6096.847578810476, 6115.908261376083, 6142.017277235621, 4576.878664727164, 6043.8489037773525, 6084.574079814371, 6130.29501607312, 6171.1668924694595, 6070.544709146831, 6097.390260973867, 6104.26748790148, 6113.663748493786, 6115.082737589397, 5780.277465316835, 6110.741024289823, 6118.923762351576, 6193.194884664965, 6259.530535209878, 4898.779554920037, 4914.189158788831, 4916.532929371704, 4922.950770492249, 4940.7035577865445, 4394.231009573312, 4422.292433210735, 4436.511983681792, 4462.933056004163, 4467.463904331501, 5514.117741161475, 5578.63738856973, 5586.972065139729, 5587.832365028974, 5686.886262274731, 6201.6899155042065, 6205.968970155121, 6216.720247588869, 6217.844553886189, 6227.750889964351, 5637.126245431965, 5674.148877668383, 5693.772249110072, 5697.116946873241, 5713.542916566665, 5245.737713114329, 5317.1492561190025, 5320.627556071116, 5370.3287089113865, 5376.704281264568, 6192.0, 6212.47193988507, 6245.5628106032145, 6248.968755156195, 6291.874162516632, 6005.3694362091355, 6191.071339299141, 6206.968965155145, 6228.501719862491, 6228.906566401598, 6226.688665566794, 6245.344238854855, 6264.248290205022, 6277.717502712298, 6306.243250809932, 5958.433948774859, 6027.849303767441, 6053.303870055, 6096.969515152573, 6101.725422356093, 6212.378762123752, 6237.313895471404, 6239.188905442264, 6240.937590624036, 6247.437730604267, 5994.160817485468, 6007.759689612367, 6013.639181649115, 6029.728662210124, 6033.42682445167, 5017.54842064216, 5130.179171332569, 5417.918731219113, 5812.18629391877, 5947.851303717442, 5869.765209391748, 5872.236609240771, 5878.382769809279, 5910.113482977587, 5913.704314784158, 5995.310539287863, 5997.160397544434, 6032.336442991355, 6035.426634469718, 6039.124326972476, 5665.830025099089, 5693.886122277614, 5776.364599894092, 5849.883002340014, 5851.970740146442], "value": 5621.138285019447, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [466.7456236351188, 493.28473713115966, 496.2704823908854, 512.7615658718695, 520.495119733858, 30303.393932121344, 34722.652773472255, 39224.803875980615, 40358.596414035885, 40419.79790101053, 36469.452958205584, 38134.427983580266, 41247.58752412475, 41624.0, 41680.58319416805, 9223.861642075392, 9351.812963740722, 9375.95312023439, 9388.765280867965, 9413.670521531747, 9233.353665243436, 9323.860142097874, 9419.48192849393, 9431.81136377272, 9446.197073248783, 9380.906190938105, 9448.24414046878, 9451.905480945172, 9455.338126331126, 9463.101005404476, 9352.392094513869, 9420.952895235549, 9427.387219830689, 9430.811383772321, 9446.52767361636, 9304.813903721955, 9321.254299656011, 9381.812363752686, 9391.859122113174, 9413.811723765486, 39028.0, 39334.60665393338, 39416.21167576661, 39432.80283598592, 39662.40506392407, 3220.114468521152, 3267.379197952381, 3293.440115180425, 3300.075978725961, 3323.0861513084096, 28517.144485665256, 29266.85366573175, 29493.101260803924, 29552.817887284484, 29656.851715741283, 3160.1625569224175, 3169.4611915974338, 3192.5690031845634, 3195.440797860365, 3201.679832016803, 414008.0, 484237.0, 491226.54386728193, 492546.0, 498020.0, 58508.0, 58966.0, 59021.40978590245, 59081.81836363249, 59100.40899590949, 35123.648763512036, 36129.277414451564, 61404.157875263816, 61493.69253153705, 61580.69209653923, 15372.385104595915, 15779.132147731985, 15809.446669366516, 15865.762013569805, 15892.205389730467, 11652.067834573214, 12101.15291929574, 12175.269483830998, 12198.878011219951, 12227.938860305641, 18777.0, 18819.435416937515, 18823.058847057593, 18857.90571047136, 18894.24423023091, 6658.800235992928, 7692.384609231248, 7702.9229707703325, 7763.805904852424, 7791.844163116706, 828.5525816059381, 984.522506584306, 993.4287784523783, 994.3785134291068, 1017.9898201018043, 28350.432991340058, 29395.0, 29410.970616028335, 30111.0, 30165.547516787265, 659.7135585607988, 889.8254304318237, 1018.9898101018895, 1049.0925349572565, 1118.5190368141614, 14615.26923653813, 15412.229388530528, 15832.208389580475, 16349.937254078446, 16359.754603680954, 678545.0, 683164.0, 684921.0, 685539.0, 687335.0, 56621.7168914161, 57084.0, 57095.0, 57142.7142864283, 57290.14064788948, 1215.3133479584008, 1257.6352857671172, 1263.033779158944, 1320.933953302331, 1384.37011159924, 29096.0, 29409.85295073511, 29871.0, 30570.694293056786, 30573.0, 48136.518634813205, 48946.818456801615, 48959.26561101658, 49052.75473622609, 49217.50782492272, 550148.0, 555928.0, 556469.0, 556532.0, 556690.0, 23355.88322058379, 26147.215583532525, 27211.86394068017, 27261.591076133478, 27768.166954991382, 43132.78433607812, 44202.778986104866, 44257.778711106235, 44399.778001109786, 44531.0, 36674.633253667125, 36756.632433675324, 36961.44557831688, 37164.81417593003, 38058.61941380551, 37305.81347093247, 37597.0, 37605.24789504249, 39089.609103908595, 39134.80432597933, 36427.0, 36906.8154659225, 37156.0, 37300.44049339208, 37879.2424151521, 32447.837760811046, 33632.66367336393, 34245.657543425245, 34292.65707342895, 34467.96596102121, 25265.115720949678, 25312.620310694987, 25608.487830243663, 25700.915890093307, 25942.740572594786], "value": 19396.713250894758, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [353.52450953467576, 371.30380536494073, 378.55708820679786, 379.30965642530595, 404.2380113486078, 14552.70894582109, 14980.176090315028, 15330.846691533081, 19665.606687866235, 20070.397888063344, 17209.139543022862, 19283.903580482078, 19397.515062123417, 20741.688874666856, 20803.583928321423, 5813.651180929158, 5928.258967629046, 6057.969710151443, 6069.817905462821, 6072.089186621998, 4928.654994150411, 5999.790007349744, 6071.63570185788, 6075.513958883279, 6079.0, 5725.942740572604, 6020.367861374559, 6024.487918526908, 6024.759009639609, 6044.486218671418, 5851.561132915027, 5945.286565612111, 5947.86990471809, 5949.167116603679, 5968.283805943272, 5031.06925218832, 5155.71643559604, 5186.97285596996, 5194.11700010999, 5215.322008138955, 20370.5925881483, 24421.14525991582, 25174.496510069697, 25430.237092887244, 25743.742562574324, 2341.274204996457, 2490.476999830038, 2758.6275852760023, 2829.9434011319863, 2957.438086763508, 15494.302756375877, 15615.9849609775, 15847.524574262676, 16126.38736126378, 16269.51191464258, 1812.2841477616269, 1900.0879577802593, 1900.9619807603908, 1954.7556555430572, 1957.9706304405445, 114936.27595586074, 118508.0, 119801.0, 120648.0, 121882.39058804649, 10657.253992220625, 10862.0, 10950.56197752081, 11116.999470047735, 11242.7189320266, 13838.515651952133, 13845.653858653613, 13865.930670346785, 13872.791908121386, 13910.652233694238, 8284.0, 8584.227419532272, 8609.139086091465, 8725.869111963326, 8742.825143497095, 7635.961820190863, 8157.3474122071275, 8608.698695545625, 8623.784405389915, 8770.868436973451, 6526.967365163238, 6639.136912201479, 6649.867002659919, 6655.5341126121675, 6662.133922590032, 1815.9455216343267, 1827.2873579304082, 1832.15720768448, 1832.395309547846, 1833.7066069428827, 402.91337362466624, 403.8990252436891, 846.2426128614856, 1012.584840215508, 1035.171862509989, 11473.598424055284, 11512.079033677286, 11748.236364636443, 11801.822972655416, 12192.878071219351, 389.2457249825418, 409.59859337849076, 419.7261311918313, 435.47742708748996, 448.55341523586173, 5043.747812609355, 6041.9395806041375, 6063.060225665029, 6192.164057852222, 6199.814005579839, 603518.0, 609601.0, 618251.0, 624096.0, 631862.0, 81301.0, 81926.0, 124105.0, 143020.5697943028, 147981.0, 894.8411806710326, 961.6201600367956, 974.181687382602, 1006.5923301063082, 1008.6772232885406, 18018.90990545039, 19269.614607707488, 19611.901940490206, 19652.803471965668, 19737.605247894673, 45511.54488455206, 54636.72681636566, 56343.0, 57102.0, 57591.0, 82998.0, 83795.0, 84992.0, 85398.0, 86797.56601216954, 7945.682172713258, 7981.8802717958115, 7990.920090799018, 8152.0, 8247.711330103417, 10340.431276279876, 12275.386230688608, 12608.243505389706, 12650.936745316583, 12651.683707907376, 10483.056524912794, 10611.31026483276, 10651.254412191072, 10846.566137354417, 11125.499352529318, 10059.245556583432, 10073.0, 10658.14734821228, 10726.785464290515, 10805.459727013775, 5805.3614102447855, 10360.378377297386, 10595.046445819913, 10853.620123295646, 11003.394813285346, 7340.70637174507, 7908.248716371935, 8036.397270204641, 8186.631601578062, 8271.13153118938, 7529.962350188214, 7579.924200757921, 7743.92256077432, 7935.40484463656, 8048.83902321962], "value": 8988.829153940573, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1302.8241187439694, 1456.2136446318984, 1489.3595753825855, 1639.5491239909024, 1828.305244007278, 7417.629118544071, 7757.418193635479, 8041.1154772975, 8399.958000210007, 8419.031811341698, 8190.672373105083, 8302.7960945663, 8304.21109994551, 8314.75055748327, 8322.958385208065, 2313.306008197538, 2343.625019996801, 2344.1443872986324, 2346.765323467648, 2346.8591884486987, 2311.410590299471, 2354.9529009419803, 2360.598698221298, 2361.740208577055, 2365.8698771567642, 2303.0557471436714, 2308.3882771065682, 2333.57995560799, 2337.777911098443, 2339.2163625185585, 2262.1290803040783, 2290.095412312144, 2321.0831721469926, 2329.9417514562188, 2334.708161479815, 2324.976750232493, 2341.1922886604093, 2349.3304408243566, 2352.3413444235644, 2361.5749165150264, 8295.502269863828, 8312.376571757142, 8377.916220837775, 8399.328053755686, 8413.032501262373, 4998.800047998076, 5195.960807838447, 5202.713850738208, 5216.2958000669805, 5221.373435187764, 3309.271960168759, 3485.1984043669845, 3494.5806503219524, 3538.0800991742076, 3554.662307080823, 951.457669128597, 1027.147467601896, 1048.2295512798087, 1085.0885256384674, 1099.763550836566, 10864.0, 10903.727406814814, 10930.0, 10940.3982780947, 10948.562057517689, 3775.4336849472797, 4342.109867477159, 4348.108637729258, 4520.683552151384, 4522.88692782683, 7217.350438460564, 8599.0, 8640.179182977607, 8658.0, 8667.653293868174, 5076.568491678248, 5101.056304583664, 5114.514121158484, 5119.539241468286, 5119.564836988898, 4265.97867010663, 4286.828526858891, 4433.423654924839, 4694.554017368345, 4775.0, 3656.122530592692, 3659.158393569494, 3686.668199862025, 3765.548134223856, 3786.1670432504807, 1140.4183866228118, 1149.5574203931546, 1151.7984352738238, 1162.7267592115845, 1166.988330116705, 779.3726050529265, 785.2108630826098, 887.4098724348365, 896.2829736211005, 898.793277546168, 4031.286703151149, 5348.732563371816, 5509.146082357241, 5781.971090144522, 5885.558583106199, 780.8360244348637, 907.7095329494498, 915.2037727177399, 918.7106061590578, 920.8848893888264, 3811.2568049230135, 3819.4461803038403, 3819.866304679323, 3829.5213098362706, 3929.548101968253, 9926.057024582653, 10153.746156346151, 10287.588496460057, 10287.742806429898, 10334.121599663962, 10252.692419227435, 10258.922813104666, 10273.0, 10278.33190842593, 10284.691459256233, 6763.425108865703, 7457.552546847098, 7835.764927052198, 8066.475679080841, 8068.47554908929, 5690.0, 5696.174054761954, 5862.0, 5903.439173278532, 5923.526117910643, 9157.816843663222, 9361.906380936103, 9421.764455888384, 9476.384035037701, 9557.761055973657, 7567.697292108254, 9637.132658060807, 9658.71023869285, 9732.318737688294, 9766.267529935425, 7225.24134965821, 7335.77992660221, 7398.926010739824, 7405.111386633423, 7405.333519983227, 7716.614169291625, 7826.099998500018, 7919.2872641462545, 7936.007999000125, 7937.404694647809, 6443.226812782496, 6759.628220447923, 7044.36600705939, 7103.2541583133025, 7295.635218239173, 5985.461308482258, 7001.439884809305, 7010.929890701028, 7016.263292354433, 7021.227664956953, 6539.444147247347, 6570.0, 6619.602823830585, 6623.503237257129, 6625.602463852184, 4431.977840110779, 4609.723416594881, 4645.930311045269, 4679.742614156118, 4859.611231101433, 4854.732989685601, 4861.878453038702, 4887.828925987574, 4962.826301079445, 5020.221865610836], "value": 4365.587099242564, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [306.14890604120546, 306.57080087876983, 312.0871451005808, 318.0664748961797, 321.23706197780274, 5052.305694954182, 5291.867703307415, 5300.867478313039, 5363.758630861611, 5365.543928766059, 4273.786310684469, 4962.478939711333, 5154.690718556889, 5225.268462415265, 5286.788528458857, 3960.1089754805225, 3986.4418981342637, 4031.850922487092, 4054.1486287879507, 4078.632923036926, 3536.504889315498, 3539.92920141597, 3815.313243616148, 3924.666403355718, 4095.8361665533344, 3900.7659540427667, 3974.0, 4046.453728746611, 4065.5934406559254, 4127.979360103211, 3455.4644030175364, 4000.83975647062, 4018.598140185987, 4030.7380020298588, 4106.3635136553885, 3045.4061458015694, 3454.0139419833445, 3482.460218666111, 3489.6335884731993, 3511.719062474996, 4219.894502637428, 4248.4052232687445, 5050.267711181895, 5097.9490205097845, 5199.856031673025, 4009.558948515661, 4492.393526873896, 4578.00140907706, 4627.506232794219, 4646.837360692393, 4798.0, 5429.945700542983, 5564.360098588673, 5573.164025396182, 5584.21820945068, 3476.096214984097, 3561.254985057329, 3592.1141400764545, 3818.694504439666, 3863.8068096595057, 4547.658440759984, 5476.918770867045, 5790.826275211708, 5804.738786754606, 5869.8239052828485, 3293.3413317336626, 3910.902227444337, 3937.8031098444962, 3944.4280579315837, 3960.940585891214, 3578.6063533011347, 3776.3957766757185, 4000.5599384067727, 4011.7793521356607, 4016.357382818793, 3988.721952758387, 4449.488308844459, 4594.264917613166, 4633.791479383436, 4648.2562789953445, 5549.72251387429, 5572.749226284827, 5576.33084029919, 5584.329880414295, 5617.9719101404235, 1275.9409689957313, 1288.4652869059423, 1292.9030322725832, 1297.156848048757, 1304.9804252936215, 797.4887588020785, 805.5408417202256, 835.8453686067975, 857.4212406625503, 858.579051669488, 4819.0, 4903.387076615423, 5346.5455436287575, 5346.97326513365, 5354.04577329272, 4887.3890763654545, 5499.0, 5573.888522229533, 5770.480656740913, 5786.334571524329, 4979.551840334388, 5191.6884986900905, 5277.419483856773, 5290.338707661543, 5293.015119330251, 2537.8731063446753, 2635.1172357260534, 2654.1904719060485, 2857.914262572126, 2862.8997985070423, 4543.545645435496, 4870.464248932614, 5703.403047146806, 5713.6857472838565, 5735.856603584861, 5274.604404669665, 5555.388907220203, 5780.046292361797, 5963.105534169909, 6028.125921741323, 5533.612647114744, 5587.6088673794075, 5987.191729116514, 6045.156227350701, 6084.421979911901, 5378.300820893259, 5646.802361917477, 5756.481916627524, 5810.273715785527, 5823.359430462561, 5298.417174110922, 5469.890602188014, 5518.310211223597, 5646.7458964347525, 5739.852029594014, 5435.619506634655, 5802.970985145047, 6024.789132380346, 6033.728482218223, 6072.8785424292155, 3237.514372844092, 3857.6528112470014, 3895.4935858338235, 3905.297046531538, 3907.257621051991, 5076.568491678101, 5133.7689803958165, 5398.541124004347, 5542.972285138549, 5827.650340979555, 4758.000819827875, 5182.756138526651, 5407.405185429679, 5530.170474428868, 5743.942560574341, 5304.416514183359, 5612.943870561242, 5619.269494965628, 5656.85857853557, 5719.399463056319, 5247.658902171346, 5490.423505532021, 5523.861903452445, 5543.784604929212, 5563.443655634404, 4442.333649952404, 5423.457654234545, 5507.705689163124, 5555.66662001952, 5662.688552129508, 5479.835604931858, 5485.4788795064405, 5486.902619476041, 5487.993764551979, 5541.0], "value": 4055.879976393101, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [661.3122352753137, 674.7975607317804, 702.2240424331114, 714.0003994407829, 767.986258139256, 14086.084404513713, 14261.0, 14793.852061479382, 14809.0, 14811.629709257273, 11448.771024579524, 12586.307753073577, 12876.742465150692, 12992.54526091587, 12997.610071697864, 624.9187605611264, 647.7052940911898, 648.6756621689156, 794.4557977785236, 805.6535689653447, 798.5168972771477, 814.1207495904409, 814.5235037503038, 815.4903185509057, 815.5555222403805, 857.2284943550823, 858.6007506509471, 859.4886042804521, 859.8409294280547, 860.3203469259278, 657.7566300468809, 677.1434135818193, 830.1117803949776, 854.8204876975811, 856.3106699107216, 618.3044075415158, 644.9322821103764, 649.0556240669814, 652.4682383857141, 652.8172111808653, 14087.295635218197, 14138.50515231962, 14138.85861141396, 14141.151530908179, 14143.717125657533, 12724.936375318157, 12977.480900763958, 13028.21984498751, 13167.60497185086, 13198.538051168163, 10426.843597346045, 10764.0, 10894.18293627973, 11152.553897844076, 11367.715807104805, 4373.978130109329, 4386.056997745468, 4389.225266271036, 4468.977655111737, 4571.58855702985, 84763.57618211869, 85237.14762852354, 86043.0, 86295.0, 89612.55193724055, 8535.402521823537, 10282.434466104436, 10498.947505262577, 10555.84166237507, 10810.945945270223, 19981.400557983285, 20061.899690501454, 20255.392338229878, 20308.289209877585, 20414.89792551028, 7556.395488360918, 7613.08642962848, 7633.847323053508, 7798.805029874298, 7860.842783144305, 4052.0754230010994, 4061.939070913939, 4069.4709687740406, 4155.854545090968, 4300.741955482681, 3300.2409445827593, 3388.593368795711, 3389.1527118220447, 3400.6769356911054, 3405.880794172192, 629.5844742469948, 645.7449307523596, 655.3250152343094, 656.3928366261284, 658.6969993802809, 516.770037333383, 574.3395095640047, 618.5422787137486, 630.8990811034682, 655.6262930129875, 8445.381931601101, 8792.78018049541, 8900.777480563038, 8954.686585969459, 8985.46087234768, 623.9251289845157, 637.3085202555279, 646.7251418147268, 650.2879347114902, 672.579637726421, 4343.435353404037, 4408.977955110204, 4423.225935461282, 4458.8439404620685, 4538.72767633943, 78766.81849772258, 78938.0, 103343.44984825233, 107109.92890071, 111358.88641113647, 63086.68456657687, 101236.98763012423, 102558.48720756348, 102975.0, 104371.4781426088, 68331.65834170797, 87844.0, 87998.0, 90811.0, 91198.0, 8439.493630382196, 8552.059273480038, 8625.69810056645, 8664.263537599123, 8866.645334186818, 53702.92594148017, 54520.90958180893, 54967.0, 55466.0, 56900.71549642391, 57852.13221801761, 62677.0, 76803.61598191973, 80042.19957800348, 82884.0, 10774.299670521392, 11129.499172537093, 11720.945114939695, 11869.690360233766, 12013.0, 13019.934900325437, 13304.866951330363, 14236.0, 14306.213158276394, 14858.108513489226, 12467.750644986869, 12889.419976100911, 12985.675358116123, 13278.601641950758, 13779.379927903068, 12488.62930284578, 12633.620991370273, 13192.538261160813, 13231.073824832169, 13277.535286264934, 12211.389430528616, 12417.130800843854, 12667.113302069136, 13129.868701312864, 13404.396802144121, 10143.340682855885, 11095.445227738743, 11337.603183888525, 11456.94271528637, 11857.822132668189, 9583.0, 9978.60085596568, 10998.890011099787, 11389.544418223179, 11424.0], "value": 7155.1541370258155, "unit": "score"}], "name": "dromaeo_css", "value": 7063.30722415485, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 115.0, 115.0, 112.0, 114.0, 114.0, 112.0, 112.0, 115.0, 117.0], "value": 112.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 111.0, 110.0, 147.0, 110.0, 111.0, 110.0, 107.0, 135.0, 108.0], "value": 119.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [186.0, 188.0, 184.0, 187.0, 186.0, 184.0, 184.0, 185.0, 184.0, 184.0], "value": 185.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 62.0, 59.0, 91.0, 64.0, 58.0, 59.0, 60.0, 82.0, 57.0], "value": 67.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 67.0, 94.0, 69.0, 68.0, 70.0, 90.0, 72.0, 68.0, 93.0], "value": 77.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 84.0, 87.0, 84.0, 89.0, 129.0, 132.0, 84.0, 86.0, 84.0], "value": 94.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 93.0, 93.0, 93.0, 93.0, 93.0, 93.0, 93.0, 119.0, 107.0], "value": 97.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 122.0, 80.0, 83.0, 93.0, 82.0, 83.0, 83.0, 81.0, 81.0], "value": 87.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 55.0, 56.0, 57.0, 58.0, 58.0, 60.0, 59.0, 56.0, 57.0], "value": 57.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 83.0, 72.0, 73.0, 72.0, 68.0, 70.0, 69.0, 70.0, 71.0], "value": 71.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 85.0, 83.0, 83.0, 82.0, 83.0, 84.0, 84.0, 82.0, 83.0], "value": 83.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 149.0, 149.0, 139.0, 140.0, 145.0, 162.0, 150.0, 189.0, 175.0], "value": 154.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 164.0, 165.0, 163.0, 165.0, 164.0, 163.0, 162.0, 175.0, 227.0], "value": 171.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 67.0, 68.0, 68.0, 66.0, 67.0, 66.0, 64.0, 68.0, 64.0], "value": 66.5, "unit": "score"}], "name": "kraken", "value": 1446.0, "alertThreshold": 2.0}]} 22:35:27 INFO - Return code: 0 22:35:27 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 22:35:27 INFO - # TBPL SUCCESS # 22:35:27 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 22:35:27 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 22:35:27 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 22:35:27 INFO - 2016-12-26 22:35:27.732 screenresolution[2262:30197] starting screenresolution argv=screenresolution get 22:35:27 INFO - 2016-12-26 22:35:27.736 screenresolution[2262:30197] Display 0: 1600x1200x32@60 22:35:27 INFO - 2016-12-26 22:35:27.742 screenresolution[2263:30200] starting screenresolution argv=screenresolution list 22:35:27 INFO - Available Modes on Display 0 22:35:27 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 22:35:27 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 22:35:27 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 22:35:27 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 22:35:27 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 22:35:27 INFO - Intel Iris: 22:35:27 INFO - Chipset Model: Intel Iris 22:35:27 INFO - Type: GPU 22:35:27 INFO - Bus: Built-In 22:35:27 INFO - VRAM (Dynamic, Max): 1536 MB 22:35:27 INFO - Vendor: Intel (0x8086) 22:35:27 INFO - Device ID: 0x0a2e 22:35:27 INFO - Revision ID: 0x0009 22:35:27 INFO - Displays: 22:35:27 INFO - Display: 22:35:27 INFO - Resolution: 1600 x 1200 @ 60 Hz 22:35:27 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 22:35:27 INFO - Display Serial Number: 1600x1200 60 22:35:27 INFO - Main Display: Yes 22:35:27 INFO - Mirror: Off 22:35:27 INFO - Online: Yes 22:35:27 INFO - Rotation: Supported 22:35:27 INFO - Return code: 0 22:35:27 INFO - Running post-action listener: _resource_record_post_action 22:35:27 INFO - [mozharness: 2016-12-27 06:35:27.982142Z] Finished run-tests step (success) 22:35:27 INFO - Running post-run listener: _resource_record_post_run 22:35:28 INFO - Total resource usage - Wall time: 1210s; CPU: 53.0%; Read bytes: 626688; Write bytes: 653856768; Read time: 6; Write time: 1962 22:35:28 INFO - TinderboxPrint: CPU usage
53.4% 22:35:28 INFO - TinderboxPrint: I/O read bytes / time
626,688 / 6 22:35:28 INFO - TinderboxPrint: I/O write bytes / time
653,856,768 / 1,962 22:35:28 INFO - TinderboxPrint: CPU idle
2,258.2 (46.6%) 22:35:28 INFO - TinderboxPrint: CPU system
965.2 (19.9%) 22:35:28 INFO - TinderboxPrint: CPU user
1,618.4 (33.4%) 22:35:28 INFO - TinderboxPrint: Swap in / out
348,909,568 / 0 22:35:28 INFO - install - Wall time: 32s; CPU: 54.0%; Read bytes: 344979968; Write bytes: 346236928; Read time: 26805; Write time: 719 22:35:28 INFO - run-tests - Wall time: 1180s; CPU: 53.0%; Read bytes: 626688; Write bytes: 300689408; Read time: 6; Write time: 1214 22:35:28 INFO - Running post-run listener: _upload_blobber_files 22:35:28 INFO - Blob upload gear active. 22:35:28 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 22:35:28 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 22:35:28 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'] 22:35:28 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 22:35:28 INFO - (blobuploader) - INFO - Open directory for files ... 22:35:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 22:35:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 22:35:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 22:35:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 22:35:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 22:35:29 INFO - (blobuploader) - INFO - Done attempting. 22:35:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 22:35:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 22:35:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 22:35:30 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 22:35:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 22:35:30 INFO - (blobuploader) - INFO - Done attempting. 22:35:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 22:35:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 22:35:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 22:35:32 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 22:35:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 22:35:32 INFO - (blobuploader) - INFO - Done attempting. 22:35:32 INFO - (blobuploader) - INFO - Iteration through files over. 22:35:32 INFO - Return code: 0 22:35:32 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 22:35:32 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 22:35:32 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2551090a953b70b3df574f06c842014f392beaffbf8e8843a4646d93a98bf0130b9518a9fd9f85240513f9dd5d6e09d3b6c81eda9a00727d532f0630cccac174", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bae221c639d4e5abddadef5c3d0f11b0e41b77d62dec80003621e1caf032a15b8fb8b999595cec9973daff0446614b4e550d8fcdca6ce068f52a8823f4a4b02d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/9fdcbf8bce1a5d2c5093ae9c20ccb5f87ce1c7aa95ecb777635f6c7f5b112d8164987ccf36ab796f08bbe34bdd5a5f1f21b2fa9f1ba337c73e9cc7021255b3e5"} 22:35:32 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 22:35:32 INFO - Writing to file /builds/slave/test/properties/blobber_files 22:35:32 INFO - Contents: 22:35:32 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2551090a953b70b3df574f06c842014f392beaffbf8e8843a4646d93a98bf0130b9518a9fd9f85240513f9dd5d6e09d3b6c81eda9a00727d532f0630cccac174", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bae221c639d4e5abddadef5c3d0f11b0e41b77d62dec80003621e1caf032a15b8fb8b999595cec9973daff0446614b4e550d8fcdca6ce068f52a8823f4a4b02d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/9fdcbf8bce1a5d2c5093ae9c20ccb5f87ce1c7aa95ecb777635f6c7f5b112d8164987ccf36ab796f08bbe34bdd5a5f1f21b2fa9f1ba337c73e9cc7021255b3e5"} 22:35:32 INFO - Running post-run listener: copy_logs_to_upload_dir 22:35:32 INFO - Copying logs to upload dir... 22:35:32 INFO - mkdir: /builds/slave/test/build/upload/logs 22:35:32 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1271.803054 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 11 secs) (at 2016-12-26 22:35:32.969957) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-26 22:35:32.973848) ========= 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.8XQzaul3nF/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.FAFDIpx2jY/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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/2551090a953b70b3df574f06c842014f392beaffbf8e8843a4646d93a98bf0130b9518a9fd9f85240513f9dd5d6e09d3b6c81eda9a00727d532f0630cccac174", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bae221c639d4e5abddadef5c3d0f11b0e41b77d62dec80003621e1caf032a15b8fb8b999595cec9973daff0446614b4e550d8fcdca6ce068f52a8823f4a4b02d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/9fdcbf8bce1a5d2c5093ae9c20ccb5f87ce1c7aa95ecb777635f6c7f5b112d8164987ccf36ab796f08bbe34bdd5a5f1f21b2fa9f1ba337c73e9cc7021255b3e5"} build_url:https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011145 build_url: 'https://queue.taskcluster.net/v1/task/ZSQoQ1FFQoi3vfvuNuGhLA/artifacts/public/build/firefox-52.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2551090a953b70b3df574f06c842014f392beaffbf8e8843a4646d93a98bf0130b9518a9fd9f85240513f9dd5d6e09d3b6c81eda9a00727d532f0630cccac174", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bae221c639d4e5abddadef5c3d0f11b0e41b77d62dec80003621e1caf032a15b8fb8b999595cec9973daff0446614b4e550d8fcdca6ce068f52a8823f4a4b02d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/9fdcbf8bce1a5d2c5093ae9c20ccb5f87ce1c7aa95ecb777635f6c7f5b112d8164987ccf36ab796f08bbe34bdd5a5f1f21b2fa9f1ba337c73e9cc7021255b3e5"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-26 22:35:33.008088) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-26 22:35:33.008455) ========= 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.8XQzaul3nF/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.FAFDIpx2jY/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/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.005408 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-26 22:35:33.057773) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-26 22:35:33.058126) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-26 22:35:33.058503) ========= ========= Total master_lag: 0.18 =========