builder: mozilla-central_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0366 starttime: 1476353534.29 results: success (0) buildid: 20161013010523 builduid: c33af5d06a714d16b3fefd03342b952b revision: 9a047a39cb2f7e4f97a8b5c0bccc3096efd0aa05 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:14.290721) ========= master: http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:14.291162) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:14.291433) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:14.316562) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:14.316961) ========= 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.e43B01ceWb/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.h6crNHCrct/Listeners TMPDIR=/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-10-13 03:12:14-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 18.7M=0.001s 2016-10-13 03:12:14 (18.7 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.083459 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:14.422435) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:14.422744) ========= 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.e43B01ceWb/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.h6crNHCrct/Listeners TMPDIR=/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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.025657 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:14.470587) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-13 03:12:14.470947) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 9a047a39cb2f7e4f97a8b5c0bccc3096efd0aa05 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 9a047a39cb2f7e4f97a8b5c0bccc3096efd0aa05 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.e43B01ceWb/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.h6crNHCrct/Listeners TMPDIR=/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-10-13 03:12:14,554 truncating revision to first 12 chars 2016-10-13 03:12:14,554 Setting DEBUG logging. 2016-10-13 03:12:14,554 attempt 1/10 2016-10-13 03:12:14,554 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/9a047a39cb2f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-13 03:12:15,571 unpacking tar archive at: mozilla-central-9a047a39cb2f/testing/mozharness/ program finished with exit code 0 elapsedTime=1.282177 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-13 03:12:15.774812) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:15.775168) ========= script_repo_revision: 9a047a39cb2f7e4f97a8b5c0bccc3096efd0aa05 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:15.775586) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:15.775871) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-13 03:12:15.794325) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 13 secs) (at 2016-10-13 03:12:15.794941) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.e43B01ceWb/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.h6crNHCrct/Listeners TMPDIR=/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:12:15 INFO - MultiFileLogger online at 20161013 03:12:15 in /builds/slave/test 03:12:15 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 03:12:15 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:12:15 INFO - {'append_to_log': False, 03:12:15 INFO - 'base_work_dir': '/builds/slave/test', 03:12:15 INFO - 'blob_upload_branch': 'Firefox', 03:12:15 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:12:15 INFO - 'branch': 'Firefox', 03:12:15 INFO - 'buildbot_json_path': 'buildprops.json', 03:12:15 INFO - 'config_files': ('talos/mac_config.py',), 03:12:15 INFO - 'default_actions': ('clobber', 03:12:15 INFO - 'read-buildbot-config', 03:12:15 INFO - 'download-and-extract', 03:12:15 INFO - 'populate-webroot', 03:12:15 INFO - 'create-virtualenv', 03:12:15 INFO - 'install', 03:12:15 INFO - 'run-tests'), 03:12:15 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:12:15 INFO - 'download_minidump_stackwalk': True, 03:12:15 INFO - 'download_symbols': 'ondemand', 03:12:15 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:12:15 INFO - 'tooltool.py': '/tools/tooltool.py', 03:12:15 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:12:15 INFO - '/tools/misc-python/virtualenv.py')}, 03:12:15 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:12:15 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:12:15 INFO - 'installer_path': 'installer.exe', 03:12:15 INFO - 'log_level': 'info', 03:12:15 INFO - 'log_name': 'talos', 03:12:16 INFO - 'log_to_console': True, 03:12:16 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 03:12:16 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 03:12:16 INFO - 'opt_config_files': (), 03:12:16 INFO - 'pip_index': False, 03:12:16 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 03:12:16 INFO - 'cmd': ('bash', 03:12:16 INFO - '-c', 03:12:16 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 03:12:16 INFO - 'enabled': True, 03:12:16 INFO - 'halt_on_failure': False, 03:12:16 INFO - 'name': 'check_screen_resolution'},), 03:12:16 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 03:12:16 INFO - 'cmd': ('bash', 03:12:16 INFO - '-c', 03:12:16 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 03:12:16 INFO - 'enabled': True, 03:12:16 INFO - 'halt_on_failure': False, 03:12:16 INFO - 'name': 'check_screen_resolution'},), 03:12:16 INFO - 'run_cmd_checks_enabled': True, 03:12:16 INFO - 'sps_profile': False, 03:12:16 INFO - 'sps_profile_interval': 0, 03:12:16 INFO - 'suite': 'dromaeojs', 03:12:16 INFO - 'system_bits': '32', 03:12:16 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:12:16 INFO - 'title': 't-yosemite-r7-0366', 03:12:16 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:12:16 INFO - 'use_talos_json': True, 03:12:16 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:12:16 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:12:16 INFO - 'work_dir': 'build'} 03:12:16 INFO - [mozharness: 2016-10-13 10:12:16.003205Z] Running clobber step. 03:12:16 INFO - Running pre-action listener: _resource_record_pre_action 03:12:16 INFO - Running main action method: clobber 03:12:16 INFO - rmtree: /builds/slave/test/build 03:12:16 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:12:18 INFO - Running post-action listener: _resource_record_post_action 03:12:18 INFO - [mozharness: 2016-10-13 10:12:18.034983Z] Finished clobber step (success) 03:12:18 INFO - [mozharness: 2016-10-13 10:12:18.035166Z] Running read-buildbot-config step. 03:12:18 INFO - Running pre-action listener: _resource_record_pre_action 03:12:18 INFO - Running main action method: read_buildbot_config 03:12:18 INFO - Using buildbot properties: 03:12:18 INFO - { 03:12:18 INFO - "project": "", 03:12:18 INFO - "product": "firefox", 03:12:18 INFO - "script_repo_revision": "production", 03:12:18 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs", 03:12:18 INFO - "repository": "", 03:12:18 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs", 03:12:18 INFO - "buildid": "20161013010523", 03:12:18 INFO - "pgo_build": "False", 03:12:18 INFO - "basedir": "/builds/slave/test", 03:12:18 INFO - "buildnumber": 4, 03:12:18 INFO - "slavename": "t-yosemite-r7-0366", 03:12:18 INFO - "master": "http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/", 03:12:18 INFO - "platform": "yosemite_r7", 03:12:18 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 03:12:18 INFO - "branch": "mozilla-central", 03:12:18 INFO - "repo_path": "mozilla-central", 03:12:18 INFO - "revision": "9a047a39cb2f7e4f97a8b5c0bccc3096efd0aa05", 03:12:18 INFO - "stage_platform": "macosx64", 03:12:18 INFO - "builduid": "c33af5d06a714d16b3fefd03342b952b", 03:12:18 INFO - "slavebuilddir": "test" 03:12:18 INFO - } 03:12:18 INFO - Found installer url https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg. 03:12:18 INFO - Running post-action listener: _resource_record_post_action 03:12:18 INFO - [mozharness: 2016-10-13 10:12:18.040467Z] Finished read-buildbot-config step (success) 03:12:18 INFO - [mozharness: 2016-10-13 10:12:18.040696Z] Running download-and-extract step. 03:12:18 INFO - Running pre-action listener: _resource_record_pre_action 03:12:18 INFO - Running main action method: download_and_extract 03:12:18 INFO - mkdir: /builds/slave/test/build/tests 03:12:18 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')]} 03:12:18 INFO - trying https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json 03:12:18 INFO - Downloading https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 03:12:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json'}, attempt #1 03:12:19 INFO - Downloaded 1199 bytes. 03:12:19 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 03:12:19 INFO - Using the following test package requirements: 03:12:19 INFO - {u'common': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 03:12:19 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 03:12:19 INFO - u'firefox-52.0a1.en-US.mac.cppunittest.tests.zip'], 03:12:19 INFO - u'gtest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 03:12:19 INFO - u'firefox-52.0a1.en-US.mac.gtest.tests.zip'], 03:12:19 INFO - u'jittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 03:12:19 INFO - u'jsshell-mac.zip'], 03:12:19 INFO - u'mochitest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 03:12:19 INFO - u'firefox-52.0a1.en-US.mac.mochitest.tests.zip'], 03:12:19 INFO - u'mozbase': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 03:12:19 INFO - u'reftest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 03:12:19 INFO - u'firefox-52.0a1.en-US.mac.reftest.tests.zip'], 03:12:19 INFO - u'talos': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 03:12:19 INFO - u'firefox-52.0a1.en-US.mac.talos.tests.zip'], 03:12:19 INFO - u'web-platform': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 03:12:19 INFO - u'firefox-52.0a1.en-US.mac.web-platform.tests.zip'], 03:12:19 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 03:12:19 INFO - u'firefox-52.0a1.en-US.mac.xpcshell.tests.zip']} 03:12:19 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip'] for test suite category: common 03:12:19 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 03:12:19 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 03:12:19 INFO - Fetch https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 03:12:19 INFO - Http code: 200 03:12:19 INFO - via: 1.1 5ed093c37d643652e278a198e0556a40.cloudfront.net (CloudFront) 03:12:19 INFO - x-amz-cf-id: xBbtx0_4Is0Ob-ib9R_5j3IkNxj6vyh4AhFP0i52qECnrOi80dOYLA== 03:12:19 INFO - x-amz-version-id: lFmPpBA8a_ya2l5JhXBriJAI_cMz.sgA 03:12:19 INFO - Expected file size: 16511076 03:12:19 INFO - Obtained file size: 16511076 03:12:26 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip', u'firefox-52.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 03:12:26 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 03:12:26 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 03:12:26 INFO - Fetch https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 03:12:27 INFO - Http code: 200 03:12:27 INFO - via: 1.1 66ed69e8b47ad05050331602c798132f.cloudfront.net (CloudFront) 03:12:27 INFO - x-amz-cf-id: Kf_Zb3K0yap6dEbELA0eOWcaLr9QNQmqUxQ7KSkrlSw4es5ql7O4LQ== 03:12:27 INFO - x-amz-version-id: lFmPpBA8a_ya2l5JhXBriJAI_cMz.sgA 03:12:27 INFO - Expected file size: 16511076 03:12:27 INFO - Obtained file size: 16511076 03:12:33 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip 03:12:33 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip'}, attempt #1 03:12:33 INFO - Fetch https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip into memory 03:12:34 INFO - Http code: 200 03:12:34 INFO - via: 1.1 49c80a47c1441dd194a8337982f1cd7e.cloudfront.net (CloudFront) 03:12:34 INFO - x-amz-cf-id: NquJ6EV2b4hshWcJhSw5FKIhDlOVmolmjrb5JhvCTj4HIr1ZB28NbA== 03:12:34 INFO - x-amz-version-id: f8d099dwCKG0weGVlI9z2j3x8Yh8kBp1 03:12:35 INFO - Expected file size: 14409006 03:12:35 INFO - Obtained file size: 14409006 03:12:35 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')]} 03:12:35 INFO - trying https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 03:12:35 INFO - Downloading https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg 03:12:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg'}, attempt #1 03:12:38 INFO - Downloaded 111707295 bytes. 03:12:38 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 03:12:38 INFO - mkdir: /builds/slave/test/properties 03:12:38 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:12:38 INFO - Writing to file /builds/slave/test/properties/build_url 03:12:38 INFO - Contents: 03:12:38 INFO - build_url:https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 03:12:39 INFO - Running post-action listener: _resource_record_post_action 03:12:39 INFO - Running post-action listener: set_extra_try_arguments 03:12:39 INFO - [mozharness: 2016-10-13 10:12:39.215191Z] Finished download-and-extract step (success) 03:12:39 INFO - [mozharness: 2016-10-13 10:12:39.215319Z] Running populate-webroot step. 03:12:39 INFO - Running pre-action listener: _resource_record_pre_action 03:12:39 INFO - Running main action method: populate_webroot 03:12:39 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:12:39 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:12:39 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:12:39 INFO - '--tppagecycles', 03:12:39 INFO - '7'], 03:12:39 INFO - 'tests': ['tsvgm']}}, 03:12:39 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:12:39 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:12:39 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:12:39 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:12:39 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:12:39 INFO - 'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:12:39 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:12:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:12:39 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:12:39 INFO - 'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['damp', 'tps']}, 03:12:39 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:12:39 INFO - 'tests': ['damp', 'tps']}, 03:12:39 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['dromaeo_dom']}, 03:12:39 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:12:39 INFO - 'g4': {'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['basic_compositor_video']}, 03:12:39 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 03:12:39 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['a11yr', 03:12:39 INFO - 'ts_paint', 03:12:39 INFO - 'tpaint', 03:12:39 INFO - 'sessionrestore', 03:12:39 INFO - 'sessionrestore_no_auto_restore', 03:12:39 INFO - 'tabpaint']}, 03:12:39 INFO - 'other-e10s': {'tests': ['a11yr', 03:12:39 INFO - 'ts_paint', 03:12:39 INFO - 'tpaint', 03:12:39 INFO - 'sessionrestore', 03:12:39 INFO - 'sessionrestore_no_auto_restore', 03:12:39 INFO - 'tabpaint']}, 03:12:39 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:12:39 INFO - 'ts_paint', 03:12:39 INFO - 'tpaint', 03:12:39 INFO - 'sessionrestore', 03:12:39 INFO - 'sessionrestore_no_auto_restore', 03:12:39 INFO - 'tabpaint']}, 03:12:39 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:12:39 INFO - 'ts_paint', 03:12:39 INFO - 'tpaint', 03:12:39 INFO - 'sessionrestore', 03:12:39 INFO - 'sessionrestore_no_auto_restore', 03:12:39 INFO - 'tabpaint']}, 03:12:39 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['a11yr', 03:12:39 INFO - 'ts_paint', 03:12:39 INFO - 'tpaint', 03:12:39 INFO - 'sessionrestore', 03:12:39 INFO - 'sessionrestore_no_auto_restore', 03:12:39 INFO - 'tabpaint']}, 03:12:39 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['a11yr', 03:12:39 INFO - 'ts_paint', 03:12:39 INFO - 'tpaint', 03:12:39 INFO - 'sessionrestore', 03:12:39 INFO - 'sessionrestore_no_auto_restore', 03:12:39 INFO - 'tabpaint']}, 03:12:39 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['tsvgx', 03:12:39 INFO - 'tsvgr_opacity', 03:12:39 INFO - 'tart', 03:12:39 INFO - 'tscrollx', 03:12:39 INFO - 'cart']}, 03:12:39 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:12:39 INFO - 'tsvgr_opacity', 03:12:39 INFO - 'tart', 03:12:39 INFO - 'tscrollx', 03:12:39 INFO - 'cart']}, 03:12:39 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:12:39 INFO - 'talos_options': ['--disable-e10s'], 03:12:39 INFO - 'tests': ['tp5o']}, 03:12:39 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:12:39 INFO - 'tests': ['tp5o']}, 03:12:39 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:12:39 INFO - 'talos_options': ['--disable-e10s', 03:12:39 INFO - '--xperf_path', 03:12:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:12:39 INFO - 'tests': ['tp5n']}, 03:12:39 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:12:39 INFO - 'talos_options': ['--xperf_path', 03:12:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:12:39 INFO - 'tests': ['tp5n']}}, 03:12:39 INFO - 'talos.zip': {'path': '', 03:12:39 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:12:39 INFO - Running post-action listener: _resource_record_post_action 03:12:39 INFO - [mozharness: 2016-10-13 10:12:39.234358Z] Finished populate-webroot step (success) 03:12:39 INFO - [mozharness: 2016-10-13 10:12:39.234469Z] Running create-virtualenv step. 03:12:39 INFO - Running pre-action listener: _resource_record_pre_action 03:12:39 INFO - Running main action method: create_virtualenv 03:12:39 INFO - Creating virtualenv /builds/slave/test/build/venv 03:12:39 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 03:12:39 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:12:39 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:12:39 INFO - Using real prefix '/tools/python27' 03:12:39 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:12:40 INFO - Installing distribute.............................................................................................................................................................................................done. 03:12:42 INFO - Installing pip.................done. 03:12:42 INFO - Return code: 0 03:12:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 03:12:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 03:12:43 INFO - Reading from file tmpfile_stdout 03:12:43 INFO - Output received: 03:12:43 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) 03:12:43 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:12:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:12:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:12:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:12:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:12:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 03:12:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 03:12:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:12:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:12:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:12:43 INFO - 'HOME': '/Users/cltbld', 03:12:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:12:43 INFO - 'LOGNAME': 'cltbld', 03:12:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:12:43 INFO - 'MOZ_NO_REMOTE': '1', 03:12:43 INFO - 'NO_EM_RESTART': '1', 03:12:43 INFO - 'PAGER': '/bin/cat', 03:12:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:12:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:12:43 INFO - 'PWD': '/builds/slave/test', 03:12:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:12:43 INFO - 'SHELL': '/bin/bash', 03:12:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:12:43 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:12:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:12:43 INFO - 'USER': 'cltbld', 03:12:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:12:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:12:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:12:43 INFO - 'XPC_FLAGS': '0x0', 03:12:43 INFO - 'XPC_SERVICE_NAME': '0', 03:12:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:12:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:12:43 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 03:12:43 INFO - Cleaning up... 03:12:43 INFO - Return code: 0 03:12:43 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:12:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:12:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:12:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:12:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:12:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 03:12:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 03:12:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:12:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:12:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:12:43 INFO - 'HOME': '/Users/cltbld', 03:12:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:12:43 INFO - 'LOGNAME': 'cltbld', 03:12:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:12:43 INFO - 'MOZ_NO_REMOTE': '1', 03:12:43 INFO - 'NO_EM_RESTART': '1', 03:12:43 INFO - 'PAGER': '/bin/cat', 03:12:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:12:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:12:43 INFO - 'PWD': '/builds/slave/test', 03:12:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:12:43 INFO - 'SHELL': '/bin/bash', 03:12:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:12:43 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:12:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:12:43 INFO - 'USER': 'cltbld', 03:12:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:12:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:12:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:12:43 INFO - 'XPC_FLAGS': '0x0', 03:12:43 INFO - 'XPC_SERVICE_NAME': '0', 03:12:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:12:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:12:43 INFO - Downloading/unpacking psutil>=3.1.1 03:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:12:47 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:12:47 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:12:47 INFO - Installing collected packages: psutil 03:12:47 INFO - Running setup.py install for psutil 03:12:47 INFO - building 'psutil._psutil_osx' extension 03:12:47 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 03:12:47 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 03:12:47 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 03:12:47 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 03:12:48 INFO - building 'psutil._psutil_posix' extension 03:12:48 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 03:12:48 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 03:12:48 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 03:12:48 INFO - ^ 03:12:48 INFO - 1 warning generated. 03:12:48 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 03:12:48 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:12:48 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:12:48 INFO - Successfully installed psutil 03:12:48 INFO - Cleaning up... 03:12:48 INFO - Return code: 0 03:12:48 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:12: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')]} 03:12:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:12:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12: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')]} 03:12:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:12:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:12: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 03:12: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 mozsystemmonitor==0.3 03:12:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:12:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:12:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:12:48 INFO - 'HOME': '/Users/cltbld', 03:12:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:12:48 INFO - 'LOGNAME': 'cltbld', 03:12:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:12:48 INFO - 'MOZ_NO_REMOTE': '1', 03:12:48 INFO - 'NO_EM_RESTART': '1', 03:12:48 INFO - 'PAGER': '/bin/cat', 03:12:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:12:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:12:48 INFO - 'PWD': '/builds/slave/test', 03:12:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:12:48 INFO - 'SHELL': '/bin/bash', 03:12:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:12:48 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:12:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:12:48 INFO - 'USER': 'cltbld', 03:12:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:12:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:12:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:12:48 INFO - 'XPC_FLAGS': '0x0', 03:12:48 INFO - 'XPC_SERVICE_NAME': '0', 03:12:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:12:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:12:48 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:12: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 03:12: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 03:12: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 03:12: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 03:12: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 03:12: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 03:12:51 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:12:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:12:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:12:51 INFO - Installing collected packages: mozsystemmonitor 03:12:51 INFO - Running setup.py install for mozsystemmonitor 03:12:51 INFO - Successfully installed mozsystemmonitor 03:12:51 INFO - Cleaning up... 03:12:51 INFO - Return code: 0 03:12:51 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:12:51 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')]} 03:12:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:12:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:51 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')]} 03:12:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:12:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:51 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 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:12:51 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 03:12:51 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 03:12:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:12:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:12:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:12:51 INFO - 'HOME': '/Users/cltbld', 03:12:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:12:51 INFO - 'LOGNAME': 'cltbld', 03:12:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:12:51 INFO - 'MOZ_NO_REMOTE': '1', 03:12:51 INFO - 'NO_EM_RESTART': '1', 03:12:51 INFO - 'PAGER': '/bin/cat', 03:12:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:12:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:12:51 INFO - 'PWD': '/builds/slave/test', 03:12:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:12:51 INFO - 'SHELL': '/bin/bash', 03:12:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:12:51 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:12:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:12:51 INFO - 'USER': 'cltbld', 03:12:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:12:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:12:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:12:51 INFO - 'XPC_FLAGS': '0x0', 03:12:51 INFO - 'XPC_SERVICE_NAME': '0', 03:12:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:12:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:12:51 INFO - Downloading/unpacking jsonschema==2.5.1 03:12:51 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 03:12:51 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 03:12:51 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 03:12:51 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 03:12:51 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 03:12:51 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 03:12:54 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:12:54 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:12:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:54 INFO - Downloading functools32-3.2.3-2.tar.gz 03:12:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:12:54 INFO - warning: no files found matching '*.txt' 03:12:54 INFO - no previously-included directories found matching 'build' 03:12:54 INFO - no previously-included directories found matching 'dist' 03:12:54 INFO - no previously-included directories found matching '.git*' 03:12:54 INFO - Installing collected packages: jsonschema, functools32 03:12:54 INFO - Running setup.py install for functools32 03:12:54 INFO - warning: no files found matching '*.txt' 03:12:54 INFO - no previously-included directories found matching 'build' 03:12:54 INFO - no previously-included directories found matching 'dist' 03:12:54 INFO - no previously-included directories found matching '.git*' 03:12:54 INFO - Successfully installed jsonschema functools32 03:12:54 INFO - Cleaning up... 03:12:55 INFO - Return code: 0 03:12:55 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 03:12:55 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')]} 03:12:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:12:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:55 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')]} 03:12:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:12:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:55 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 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:12:55 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 03:12:55 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 03:12:55 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:12:55 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:12:55 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:12:55 INFO - 'HOME': '/Users/cltbld', 03:12:55 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:12:55 INFO - 'LOGNAME': 'cltbld', 03:12:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:12:55 INFO - 'MOZ_NO_REMOTE': '1', 03:12:55 INFO - 'NO_EM_RESTART': '1', 03:12:55 INFO - 'PAGER': '/bin/cat', 03:12:55 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:12:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:12:55 INFO - 'PWD': '/builds/slave/test', 03:12:55 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:12:55 INFO - 'SHELL': '/bin/bash', 03:12:55 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:12:55 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:12:55 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:12:55 INFO - 'USER': 'cltbld', 03:12:55 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:12:55 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:12:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:12:55 INFO - 'XPC_FLAGS': '0x0', 03:12:55 INFO - 'XPC_SERVICE_NAME': '0', 03:12:55 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:12:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:12:55 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 03:12:55 INFO - Cleaning up... 03:12:55 INFO - Return code: 0 03:12:55 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:12:55 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')]} 03:12:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:12:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:55 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')]} 03:12:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:12:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:12:55 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 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:12:55 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 03:12:55 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 03:12:55 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:12:55 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:12:55 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:12:55 INFO - 'HOME': '/Users/cltbld', 03:12:55 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:12:55 INFO - 'LOGNAME': 'cltbld', 03:12:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:12:55 INFO - 'MOZ_NO_REMOTE': '1', 03:12:55 INFO - 'NO_EM_RESTART': '1', 03:12:55 INFO - 'PAGER': '/bin/cat', 03:12:55 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:12:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:12:55 INFO - 'PWD': '/builds/slave/test', 03:12:55 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:12:55 INFO - 'SHELL': '/bin/bash', 03:12:55 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:12:55 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:12:55 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:12:55 INFO - 'USER': 'cltbld', 03:12:55 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:12:55 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:12:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:12:55 INFO - 'XPC_FLAGS': '0x0', 03:12:55 INFO - 'XPC_SERVICE_NAME': '0', 03:12:55 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:12:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:12:55 INFO - Downloading/unpacking blobuploader==1.2.4 03:12:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:58 INFO - Downloading blobuploader-1.2.4.tar.gz 03:12:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:12:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:12:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:12:58 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:12:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:12:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:12:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:12:59 INFO - Downloading docopt-0.6.1.tar.gz 03:12:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:12:59 INFO - Installing collected packages: blobuploader, requests, docopt 03:12:59 INFO - Running setup.py install for blobuploader 03:12:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:12:59 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:12:59 INFO - Running setup.py install for requests 03:13:00 INFO - Running setup.py install for docopt 03:13:00 INFO - Successfully installed blobuploader requests docopt 03:13:00 INFO - Cleaning up... 03:13:00 INFO - Return code: 0 03:13:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:13: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')]} 03:13:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:13:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:13: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')]} 03:13:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:13:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:13:00 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 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:13:00 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 03:13:00 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 03:13:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:13:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:13:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:13:00 INFO - 'HOME': '/Users/cltbld', 03:13:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:13:00 INFO - 'LOGNAME': 'cltbld', 03:13:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:13:00 INFO - 'MOZ_NO_REMOTE': '1', 03:13:00 INFO - 'NO_EM_RESTART': '1', 03:13:00 INFO - 'PAGER': '/bin/cat', 03:13:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:13:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:13:00 INFO - 'PWD': '/builds/slave/test', 03:13:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:13:00 INFO - 'SHELL': '/bin/bash', 03:13:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:13:00 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:13:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:13:00 INFO - 'USER': 'cltbld', 03:13:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:13:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:13:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:13:00 INFO - 'XPC_FLAGS': '0x0', 03:13:00 INFO - 'XPC_SERVICE_NAME': '0', 03:13:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:13:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:13:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:13:00 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-lGBIyq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:13:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:13:00 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-Nsi9NW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:13:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:13:00 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-wwAWXV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:13:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:13:00 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-9du5rM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:13:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:13:00 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-YecjaX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-pXbbhh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-Yqobab-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-dw6gEP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-R27T4U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-m9VXx9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-moHiwf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-5JPghQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-S87Y8n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:13:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:13:01 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-TKD7wx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:13:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:13:02 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-CD1d0i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:13:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:13:02 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-H8Xv6M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:13:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:13:02 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-Nc3KDN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:13:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:13:02 INFO - Running setup.py install for manifestparser 03:13:02 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:13:02 INFO - Running setup.py install for mozcrash 03:13:02 INFO - Running setup.py install for mozdebug 03:13:02 INFO - Running setup.py install for mozdevice 03:13:02 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:13:02 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:13:02 INFO - Running setup.py install for mozfile 03:13:03 INFO - Running setup.py install for mozhttpd 03:13:03 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:13:03 INFO - Running setup.py install for mozinfo 03:13:03 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:13:03 INFO - Running setup.py install for mozInstall 03:13:03 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:13:03 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:13:03 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:13:03 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:13:03 INFO - Running setup.py install for mozleak 03:13:03 INFO - Running setup.py install for mozlog 03:13:03 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:13:03 INFO - Running setup.py install for moznetwork 03:13:03 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:13:03 INFO - Running setup.py install for mozprocess 03:13:04 INFO - Running setup.py install for mozprofile 03:13:04 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:13:04 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:13:04 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:13:04 INFO - Running setup.py install for mozrunner 03:13:04 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:13:04 INFO - Running setup.py install for mozscreenshot 03:13:04 INFO - Running setup.py install for moztest 03:13:04 INFO - Running setup.py install for mozversion 03:13:04 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:13:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:13:04 INFO - Cleaning up... 03:13:04 INFO - Return code: 0 03:13:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:13:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:13:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:13:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:13:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:13:04 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 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:13:04 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 03:13:04 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 03:13:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:13:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:13:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:13:04 INFO - 'HOME': '/Users/cltbld', 03:13:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:13:04 INFO - 'LOGNAME': 'cltbld', 03:13:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:13:04 INFO - 'MOZ_NO_REMOTE': '1', 03:13:04 INFO - 'NO_EM_RESTART': '1', 03:13:04 INFO - 'PAGER': '/bin/cat', 03:13:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:13:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:13:04 INFO - 'PWD': '/builds/slave/test', 03:13:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:13:04 INFO - 'SHELL': '/bin/bash', 03:13:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:13:04 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:13:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:13:04 INFO - 'USER': 'cltbld', 03:13:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:13:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:13:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:13:04 INFO - 'XPC_FLAGS': '0x0', 03:13:04 INFO - 'XPC_SERVICE_NAME': '0', 03:13:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:13:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:13:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:13:05 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-ruqJln-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:13:05 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)) 03:13:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:13:05 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-2sGuE2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:13:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:13:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:13:05 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-QtE_wp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:13:05 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)) 03:13:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:13:05 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-iiRVec-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:13:05 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)) 03:13:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:13:05 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-5IH1vY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:13:05 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)) 03:13:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:13:05 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-qyV6dR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:13:05 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)) 03:13:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:13:05 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-PnYJuF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:13:05 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)) 03:13:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:13:05 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-MaP3zY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:13:06 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)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-HZfGUs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:13:06 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)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-D4NGgo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:13:06 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)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-Wv0L8U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:13:06 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)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-7UjZ3d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:13:06 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)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-8ei1bE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:13:06 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)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-xUJZOW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:13:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-TmEARL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:13:06 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)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-9luvFg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:13:06 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)) 03:13:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:13:06 INFO - Running setup.py (path:/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/pip-5TQYNW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:13:06 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)) 03:13:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:13:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:13:06 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)) 03:13:06 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)) 03:13:06 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)) 03:13:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:13:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:13:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:13:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:13:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:13:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:13:07 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 03:13:09 INFO - Downloading blessings-1.6.tar.gz 03:13:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:13:09 INFO - Installing collected packages: blessings 03:13:09 INFO - Running setup.py install for blessings 03:13:09 INFO - Successfully installed blessings 03:13:09 INFO - Cleaning up... 03:13:09 INFO - Return code: 0 03:13:09 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:13:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:13:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:13:10 INFO - Reading from file tmpfile_stdout 03:13:10 INFO - Current package versions: 03:13:10 INFO - blessings == 1.6 03:13:10 INFO - blobuploader == 1.2.4 03:13:10 INFO - docopt == 0.6.1 03:13:10 INFO - functools32 == 3.2.3-2 03:13:10 INFO - jsonschema == 2.5.1 03:13:10 INFO - manifestparser == 1.1 03:13:10 INFO - mozInstall == 1.12 03:13:10 INFO - mozcrash == 0.17 03:13:10 INFO - mozdebug == 0.1 03:13:10 INFO - mozdevice == 0.48 03:13:10 INFO - mozfile == 1.2 03:13:10 INFO - mozhttpd == 0.7 03:13:10 INFO - mozinfo == 0.9 03:13:10 INFO - mozleak == 0.1 03:13:10 INFO - mozlog == 3.4 03:13:10 INFO - moznetwork == 0.27 03:13:10 INFO - mozprocess == 0.23 03:13:10 INFO - mozprofile == 0.28 03:13:10 INFO - mozrunner == 6.12 03:13:10 INFO - mozscreenshot == 0.1 03:13:10 INFO - mozsystemmonitor == 0.3 03:13:10 INFO - moztest == 0.7 03:13:10 INFO - mozversion == 1.4 03:13:10 INFO - psutil == 3.1.1 03:13:10 INFO - requests == 1.2.3 03:13:10 INFO - wsgiref == 0.1.2 03:13:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:13: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')]} 03:13:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:13:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:13: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')]} 03:13:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:13:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:13:10 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 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:13:10 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 03:13:10 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 03:13:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:13:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:13:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:13:10 INFO - 'HOME': '/Users/cltbld', 03:13:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:13:10 INFO - 'LOGNAME': 'cltbld', 03:13:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:13:10 INFO - 'MOZ_NO_REMOTE': '1', 03:13:10 INFO - 'NO_EM_RESTART': '1', 03:13:10 INFO - 'PAGER': '/bin/cat', 03:13:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:13:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:13:10 INFO - 'PWD': '/builds/slave/test', 03:13:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:13:10 INFO - 'SHELL': '/bin/bash', 03:13:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:13:10 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:13:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:13:10 INFO - 'USER': 'cltbld', 03:13:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:13:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:13:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:13:10 INFO - 'XPC_FLAGS': '0x0', 03:13:10 INFO - 'XPC_SERVICE_NAME': '0', 03:13:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:13:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 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)) 03:13:10 INFO - Cleaning up... 03:13:10 INFO - Return code: 0 03:13:10 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:13: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')]} 03:13:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:13:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:13: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')]} 03:13:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:13:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:13:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1015fc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101572570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff46b4e0890>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, '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.e43B01ceWb/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.h6crNHCrct/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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 03:13:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 03:13:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 03:13:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:13:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:13:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:13:10 INFO - 'HOME': '/Users/cltbld', 03:13:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:13:10 INFO - 'LOGNAME': 'cltbld', 03:13:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:13:10 INFO - 'MOZ_NO_REMOTE': '1', 03:13:10 INFO - 'NO_EM_RESTART': '1', 03:13:10 INFO - 'PAGER': '/bin/cat', 03:13:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:13:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:13:10 INFO - 'PWD': '/builds/slave/test', 03:13:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:13:10 INFO - 'SHELL': '/bin/bash', 03:13:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:13:10 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:13:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:13:10 INFO - 'USER': 'cltbld', 03:13:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:13:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:13:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:13:10 INFO - 'XPC_FLAGS': '0x0', 03:13:10 INFO - 'XPC_SERVICE_NAME': '0', 03:13:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:13:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:13:10 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:13:10 INFO - Cleaning up... 03:13:10 INFO - Return code: 0 03:13:10 INFO - Running post-action listener: _resource_record_post_action 03:13:10 INFO - Running post-action listener: _start_resource_monitoring 03:13:11 INFO - Starting resource monitoring. 03:13:11 INFO - [mozharness: 2016-10-13 10:13:11.012959Z] Finished create-virtualenv step (success) 03:13:11 INFO - [mozharness: 2016-10-13 10:13:11.013929Z] Running install step. 03:13:11 INFO - Running pre-action listener: _resource_record_pre_action 03:13:11 INFO - Running main action method: install 03:13:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:13:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:13:11 INFO - Reading from file tmpfile_stdout 03:13:11 INFO - Detecting whether we're running mozinstall >=1.0... 03:13:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:13:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:13:11 INFO - Reading from file tmpfile_stdout 03:13:11 INFO - Output received: 03:13:11 INFO - Usage: mozinstall [options] installer 03:13:11 INFO - Options: 03:13:11 INFO - -h, --help show this help message and exit 03:13:11 INFO - -d DEST, --destination=DEST 03:13:11 INFO - Directory to install application into. [default: 03:13:11 INFO - "/builds/slave/test"] 03:13:11 INFO - --app=APP Application being installed. [default: firefox] 03:13:11 INFO - mkdir: /builds/slave/test/build/application 03:13:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 03:13:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 03:13:45 INFO - Reading from file tmpfile_stdout 03:13:45 INFO - Output received: 03:13:45 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 03:13:45 INFO - Running post-action listener: _resource_record_post_action 03:13:45 INFO - [mozharness: 2016-10-13 10:13:45.002580Z] Finished install step (success) 03:13:45 INFO - [mozharness: 2016-10-13 10:13:45.002752Z] Running run-tests step. 03:13:45 INFO - Running pre-action listener: _resource_record_pre_action 03:13:45 INFO - Running main action method: run_tests 03:13:45 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:13:45 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:13:45 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:13:45 INFO - 2016-10-13 03:13:45.017 screenresolution[1638:7673] starting screenresolution argv=screenresolution get 03:13:45 INFO - 2016-10-13 03:13:45.019 screenresolution[1638:7673] Display 0: 1600x1200x32@60 03:13:45 INFO - 2016-10-13 03:13:45.025 screenresolution[1639:7675] starting screenresolution argv=screenresolution list 03:13:45 INFO - Available Modes on Display 0 03:13:45 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:13:45 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:13:45 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:13:45 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:13:45 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:13:45 INFO - Intel Iris: 03:13:45 INFO - Chipset Model: Intel Iris 03:13:45 INFO - Type: GPU 03:13:45 INFO - Bus: Built-In 03:13:45 INFO - VRAM (Dynamic, Max): 1536 MB 03:13:45 INFO - Vendor: Intel (0x8086) 03:13:45 INFO - Device ID: 0x0a2e 03:13:45 INFO - Revision ID: 0x0009 03:13:45 INFO - Displays: 03:13:45 INFO - Display: 03:13:45 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:13:45 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:13:45 INFO - Display Serial Number: 1600x1200 60 03:13:45 INFO - Main Display: Yes 03:13:45 INFO - Mirror: Off 03:13:45 INFO - Online: Yes 03:13:45 INFO - Rotation: Supported 03:13:45 INFO - Return code: 0 03:13:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:13:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:13:45 INFO - Python 2.7.3 03:13:45 INFO - Return code: 0 03:13:45 INFO - grabbing minidump binary from tooltool 03:13:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:13:45 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 0x101410d30>, '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 0x101236db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x101408b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:13:45 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 03:13:45 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 03:13:45 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 03:13:45 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:13:45 INFO - Return code: 0 03:13:45 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 03:13:45 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:13:45 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:13:45 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 03:13:45 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:13:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0366', '--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 03:13:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0366 --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 03:13:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.e43B01ceWb/Render', 03:13:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:13:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:13:45 INFO - 'HOME': '/Users/cltbld', 03:13:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:13:45 INFO - 'LOGNAME': 'cltbld', 03:13:45 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:13:45 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 03:13:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:13:45 INFO - 'MOZ_NO_REMOTE': '1', 03:13:45 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:13:45 INFO - 'NO_EM_RESTART': '1', 03:13:45 INFO - 'PAGER': '/bin/cat', 03:13:45 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:13:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:13:45 INFO - 'PWD': '/builds/slave/test', 03:13:45 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:13:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:13:45 INFO - 'SHELL': '/bin/bash', 03:13:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.h6crNHCrct/Listeners', 03:13:45 INFO - 'TMPDIR': '/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/', 03:13:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:13:45 INFO - 'USER': 'cltbld', 03:13:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:13:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:13:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:13:45 INFO - 'XPC_FLAGS': '0x0', 03:13:45 INFO - 'XPC_SERVICE_NAME': '0', 03:13:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:13:45 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0366', '--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 03:13:45 INFO - mozversion application_buildid: 20161013010523 03:13:45 INFO - mozversion application_changeset: 9a047a39cb2f7e4f97a8b5c0bccc3096efd0aa05 03:13:45 INFO - mozversion application_display_name: Nightly 03:13:45 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:13:45 INFO - mozversion application_name: Firefox 03:13:45 INFO - mozversion application_remotingname: firefox 03:13:45 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 03:13:45 INFO - mozversion application_vendor: Mozilla 03:13:45 INFO - mozversion application_version: 52.0a1 03:13:45 INFO - mozversion platform_buildid: 20161013010523 03:13:45 INFO - mozversion platform_changeset: 9a047a39cb2f7e4f97a8b5c0bccc3096efd0aa05 03:13:45 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 03:13:45 INFO - mozversion platform_version: 52.0a1 03:13:45 INFO - using testdate: 1476353625 03:13:45 INFO - actual date: 1476353625 03:13:45 INFO - starting webserver on 'localhost:49277' 03:13:45 INFO - SUITE-START | Running 2 tests 03:13:45 INFO - TEST-START | dromaeo_css 03:13:45 INFO - operating with platform_type : mac_ 03:13:45 INFO - Initialising browser for dromaeo_css test... 03:13:45 INFO - TEST-INFO | started process 1649 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/tmpuZZmCh/profile http://localhost:49277/getInfo.html) 03:13:47 INFO - PROCESS | 1649 | __metrics Screen width/height:1600/1200 03:13:47 INFO - PROCESS | 1649 | colorDepth:24 03:13:47 INFO - PROCESS | 1649 | Browser inner width/height: 1024/689 03:13:47 INFO - PROCESS | 1649 | __metrics 03:13:48 INFO - PROCESS | 1649 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 03:13:48 INFO - PROCESS | 1649 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:13:48 INFO - TEST-INFO | 1649: exit 0 03:13:48 INFO - Browser initialized. 03:13:48 INFO - Running cycle 1/1 for dromaeo_css test... 03:13:48 INFO - TEST-INFO | started process 1651 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/tmpuZZmCh/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:14:00 INFO - PROCESS | 1651 | RSS: Main: 235372544 03:14:00 INFO - PROCESS | 1651 | 03:14:52 INFO - PROCESS | 1651 | 1476353692416 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] 03:17:05 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49277/tests/dromaeo/cssquery-ext.html) 03:17:06 INFO - PROCESS | 1651 | RSS: Main: 381923328 03:17:06 INFO - PROCESS | 1651 | 03:20:09 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-ext.html (next: http://localhost:49277/tests/dromaeo/cssquery-jquery.html) 03:20:10 INFO - PROCESS | 1651 | RSS: Main: 375103488 03:20:10 INFO - PROCESS | 1651 | 03:23:12 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49277/tests/dromaeo/cssquery-mootools.html) 03:23:12 INFO - PROCESS | 1651 | RSS: Main: 362840064 03:23:12 INFO - PROCESS | 1651 | 03:26:15 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49277/tests/dromaeo/cssquery-prototype.html) 03:26:15 INFO - PROCESS | 1651 | RSS: Main: 335720448 03:26:15 INFO - PROCESS | 1651 | 03:29:19 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49277/tests/dromaeo/cssquery-yui.html) 03:29:19 INFO - PROCESS | 1651 | RSS: Main: 327159808 03:29:19 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-yui.html (next: http://localhost:49277/tests/dromaeo/cssquery-dojo.html) 03:32:23 INFO - PROCESS | 1651 | RSS: Main: 452632576 03:32:23 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | __start_tp_report 03:32:23 INFO - PROCESS | 1651 | _x_x_mozilla_page_load 03:32:23 INFO - PROCESS | 1651 | _x_x_mozilla_page_load_details 03:32:23 INFO - PROCESS | 1651 | |i|pagename|runs| 03:32:23 INFO - PROCESS | 1651 | |0;dojo.html;3307.5038744188373;3311.7847339922905;3312.9668703312973;3336.4494858348376;3373.932521349573;5514.172874068881;5606;5613.43865613439;5656.802011929583;5668.773249070043;5562.7774889004395;5601.411851755568;5604.019296623085;5610.214569960209;5627.099664053752;5062.392512898448;5112.207607820775;5123.5388815006645;5152.587792976572;5156.845294641167;5186.273921650972;5210.218467229927;5212.400573933989;5212.6611770235;5215.113430716788;5132.666376685504;5177.48225177483;5183.2743415921805;5199.974000129994;5204.505571970676;5189.455107213726;5219.11275083233;5227.895442091137;5231.65994210377;5296.3379577552805;5024.673396229234;5024.874378140539;5059.367579052619;5114.872128196787;5142.845714628567;5554.694491802949;5560.972195139039;5589.217509548666;5610.382857885629;5638.548916086703;6088.1476593276975;6096.542759293026;6112.602680825732;6113.602615830001;6118.418750218722;5741.425857414267;5967.104934259853;6095.664738439384;6122.693865306762;6175.258968923713;5634.943650563524;5643.238162848045;5652.66084034951;5686;5692.060809966392;6274.529410294155;6298.1812364392335;6315.810525684236;6320.525960552977;6329.715162817684;5730.455606717439;5798.217240672539;5837.532997360201;5889.057750759858;5952.85117872048;6036.698165091728;6040.879182416327;6054.788082417094;6055.576109672369;6058.818235452944;5005.74971251436;5924;5973.731182096729;6016.729247183887;6067.878642427127;6069.241344831896;6087.817365478954;6087.969560152171;6089.634621922699;6111.236095488064;4841.491643377465;4843.709377437365;4848.466668666444;4854.514548545118;4900.583450406755;4290.699651024398;4312.741235525816;4331.610155086058;4367.388565600819;4385.802638881258;5548.528375088082;5589.804356847572;5589.972050139804;5602.579806514446;5642.379338272786;6106.328303886569;6125.142480052797;6136.754529818846;6156.230471191101;6160.753569857246;5414.458554144554;5569.498745112959;5583.553315734732;5594.636348637326;5599.8600034998635;5232.816851410183;5264.6051546134195;5291.417944026231;5323.148296272655;5329.973350133302;6342.112104305494;6372.55392122547;6373.553851230369;6376.171097757448;6378.330275321025;6126.846828829315;6143.662098584621;6169.105479705508;6177.413145751147;6183.4541364658835;6135.93706321624;6282.591631543935;6302.527310451826;6303.180586523723;6349.142865713255;5991.161237426851;6094.939050609437;6111.96944015277;6115.143879856734;6121.663308518075;6135.570510064253;6137.631742095488;6140.140380346666;6148.44663980244;6155;4859.757012149449;5908.763649453974;6007.219061522149;6024.9397506026135;6033.3061697905305;5806.303243610793;5897.292324921037;5900.527957763283;5964.821055368346;6025.397460253939;5873.324567674772;5874.647521148745;5875.20684707559;5889.587728858939;5910.940890591211;5973.49225315853;6019.668918209541;6028.608140470856;6030.276366836008;6043.7884674036195;5622.493975542221;5668.234788303691;5769.394213607511;5857.58996870215;5886.411358864079 03:32:23 INFO - PROCESS | 1651 | |1;ext.html;485.8688154198369;520.7942862569284;533.1123679074342;554.9556035517157;564.2861779848492;30267.545986810186;39798.80603581893;41223.79388103059;41239.969000774996;43493.13013739723;33490.66509334906;34876.47685284723;42016.57983420165;42612;42651.78674106633;9454.29092818038;9638.373505722106;9641.662541811038;9646.372985755903;9686.418814871095;9557.09207625278;9656.75858103546;9657.758556036086;9663.468509231989;9667.468289244089;9624.951875240615;9682.225421966226;9682.757931051745;9703;9714.22286217101;9577.521123943776;9632.27757918159;9641.421514709069;9649.276304277173;9661.246544734717;9337.626494940194;9341.065893410605;9425.575849086808;9509.857352139723;9515.23878089758;40417.59582404168;40792.59207407918;40810.79594602008;40876.18247635031;40923.386149207785;3231;3304.273059926812;3320.634730179678;3716.6655001049767;3888.0279930017496;30133.945311913976;30397.392052158833;30944;31096.533551996738;31999.680003199905;3175.9682403175902;3178.332550164468;3229.2088438332758;3274.2141885947203;3309.5366648668964;494878;495087.9999999964;497114;498866;510831;61435.46411339663;61710;61787;61854.381456185765;61869.381306187264;29424.852875735483;34299.65700343015;34586.48120278198;65209;65590.34409655938;16245.51263462098;16404.26180821866;16411.42560010394;16418.589535261715;16422.75365869513;12535.059870509749;12627.810582841264;12652.430640621194;12653.810192847115;12663.050271229695;18954.526136846413;18975.90512047431;18981.715274270897;18995.715064274045;19003;7589.848203035908;7720.3437707795465;7745.10931242903;7781.832725091282;7854.096778870388;879.5030807593689;898.7528429681759;967.4437198610827;998.2962011781676;1004.4776716107583;28765.712342876723;29667.554986675215;29853.701462985093;30550.236244094074;30733.69266307353;865.7835541114721;985.669800616787;1014.8579198912158;1043.8903915088958;1104.276698762312;15354;15357;15535.532335724169;15599.844001559839;15815.367385304458;682334;685763;685987;688007;691770;57277.85444291091;57758.422415775305;57829.710851445474;57862;57881.421185788444;1035.3684252605904;1220.5544976083665;1308.2673702726504;1319.1425573377383;1321.0686466041225;28731.85634071816;29675.109746707632;30730.692693072782;32115;32576.83711581427;50525.73685657888;51702.22446663228;51763.74118129385;51772.22341664953;51822;538263;541374;551528;555909;557648;42457.36313955231;42990.35514467223;43829.90425239394;43918.780406097765;43946.12107757891;47577;48287.75856120697;48777.2683409742;48857.02285954332;48875.51124488709;38964.41553376645;39507.802460987514;39565;40245.26920337385;41564.01231852197;39073.023174420865;39219.82340529789;39527.40708889312;40447.393289101274;40694.982625434604;38587.6141238584;38962;39395;39460.81617551478;40050.1989960205;26662.466750665266;30475.085747427613;30706.385872282877;32299.031029069167;33630.327393452484;22228;25427.87286063558;25605.871970640026;26121.216363509124;26341.34146646349 03:32:23 INFO - PROCESS | 1651 | |2;jquery.html;358.7130295763392;375.52496092443045;381.728972429575;387.103854576655;412.2908597212793;14979.325930333134;15359.308831102599;17590.208440620172;20192.091355888984;20226.190952361925;20146.69779953302;20193.394198174043;20806.89596552015;20834.479138021557;21056.263030793885;4876.195427754416;5706.857328566788;5780.421957804228;6004.909926351108;6022.367651396606;5755.539556835464;5947.256592925884;5958.136070269808;5961.403859614047;5970.79102231422;5655.688937108457;5781.386633354154;5871.2073870027425;5892.675902825343;5895.675737834439;5799.768009279624;5856.824295271149;5867.295924489046;5872.882542349151;5874.853128671774;4886;5086;5124.564412024983;5143.074246635604;5153.768080436389;25187;25889.22332330033;25934.87032564844;25966.74033259681;26338.078167264055;2398.832081754278;2401.147592604635;2411.602085655865;2656.1102030819698;2781.443711257736;9358.672446464341;9912.355696879751;9934.403935763878;15615.375384984587;16020;1838.6138910828743;1872.9812701872943;1882.717592361143;1911.9044047797693;1970.3596331192277;104039;118734;124135;125032;125868.37065814703;10905.945470272598;11016.228863979604;11425.257358271685;11458.026067784333;11650.30098194111;14416.927915360357;14420.351084201237;14430.917681173954;14459.421623135167;14460.710785784226;7466.991956085967;8027.6788928443375;8238.670453181805;8246.958765206256;8368.916310836936;7289.432771954055;7812.843743125106;7899;8180.304674102649;8447.704330348408;4445.73325600465;4468.642508599304;4469.553044695569;4482.193205223091;4538.546145385501;1609.4286528282291;1861.4322631597222;1899.7435346228083;1903.0770076513156;1912.149093653311;759.9620018999028;784.901887264092;828.6561077152915;838.1325328285195;890.0832142892831;20476;21209;21303.147874085174;21340.359789206348;21483;905.5653286422422;909.1953621045423;926.8980412154658;982.6806287956442;1019.5819713917258;9335.206507446806;10520.421376824348;11105.05607023412;11157.047516684548;11170.776584468265;555379;580215;592664.0366798139;599935;613128.9343553254;55564;64031;71604.209894752;80782;134007;855.619249433996;907.1291560102244;938.8920274168559;957.4973139101888;959.8464245720791;17007.404740834507;18251.726224106915;18425.447236582924;18449.723254151468;18528;50910.74544627253;51490.74254628703;52174;52207.95584088373;53391.199132012276;73830;74184;77065;77637.61181194057;78188.21811781809;6670.799876003728;7840.980672512537;7947.403944704286;8071.596420179085;8306.875396869173;11900.285982841056;12785.552505662257;13026.08817382774;13119.672008199872;13128.868711312765;11221.214514983873;11394.658160255205;11548.18909759794;11615.535378584762;11646.94176529112;11103.16726245551;11109.611163609236;11299;11534.423278835857;11561.942190289332;9216.585253663736;9692.9030709692;10516.894831051592;11578.015868650922;11752.529898803952;6815.93184068153;7211.3870321023305;7220.1696804866015;7460.0301960744755;8463.153684631734;9296.442213467213;10657.786844263226;10936.121206682748;10965.396903170402;11170.664880053611 03:32:23 INFO - PROCESS | 1651 | |3;mootools.html;1229.4836168809102;1266.366816591704;1457.4753088887999;1607.742761158215;1887.5469887227061;7778.805529861749;8254.876176857337;8258.339332853373;8268.255856972879;8270.37972152088;7508.286712762292;8124.756257312275;8361.414700970934;8410.789730256747;8677.69628063018;2287.7025986621716;2309.90760369585;2354.5761762882676;2356.257778799681;2356.7643235676464;2021.5047313408236;2299.356180269527;2348.1546643208517;2350.764923507653;2352.8353015288935;2297.4141593893532;2320.791128798408;2329.1615018593293;2336.100601268515;2338.5907466193435;2280.703508543895;2306.2735238399932;2312.387217387394;2313.248194336847;2319.4665226997718;2300.9424764381024;2308.6421604651305;2310.4108452344713;2311.9653205201766;2313.051648823974;8698.304135669194;8779.78050548735;8804.691835785718;8821.867671984925;8850.557472126367;5126.410462796752;5192.506711862367;5356.625036247464;5367.141257398797;5367.35591728995;3551.3252482028333;3646.307201631708;3647.3070116677745;3650.7992060436663;3651.908702282438;1045.7699306152633;1053.0890779475774;1067.786442711453;1078.7626722121122;1080.3949788118678;11342.319460832376;11428.542858285742;11434.371109588968;11443.656690299222;11488.138389620812;4302.26861433557;4325.480942286946;4369.60673539383;4394.67039971997;4562.8631141065825;9000.59497322622;9014.954925225333;9016.96304924942;9037.68368107113;9037.954810225907;5066.341375621219;5069.9746501267255;5070.4929507049;5073.046876952326;5100.821471248489;4121.361189015707;4415.558444155558;4507.4365704286965;4576.6109880660515;4745.9050818984115;3688.6495782900583;3697.6302369762807;3741.5884252732176;3761.4390028138564;3765.378712512405;1130.2032067392634;1139.8347239650204;1145.8052131137727;1147.4320211495196;1150.2523359816187;770.8265640231016;862.607513581319;865.5628907401848;871.1288711288711;878.9252913502424;5330.253764472977;5363.168708850135;5484.61607687466;5527.917081243784;5660.018993352293;387.46142861422646;421.496311907274;431.0559873876264;439.4287426345738;441.5760869565189;3455.4644030175364;3633.2006958469096;3653.634636536325;3707.4068149096015;3716.6283371662616;10385.065344119066;10875;10907.618233361794;10921.344719316867;10944.781104377867;10838.566457341776;10849.132069434427;10858.67423977282;10870.184736144663;10883.96602322778;8167.959160204161;8259.669613215525;8261.752147435587;8265.214804593554;8265.669373225124;5281.181416880389;5417.349918009864;5507.421720719427;5510.283663123768;5532.6680399176175;9768.804623907625;10049.648262310784;10110.747231319276;10124;10143.79712405733;9293.767655808388;9952.054554817281;10093.343932644355;10225.642102526674;10339.741506462398;5767.307923049261;6593.571417858016;6715.764948226789;6920.342567456084;7032.367086962198;8137.877931830909;8149.918500814916;8163.755087347389;8197.975253093364;8252.174782521699;7327.230640782855;7332.523385979895;7359.337659610661;7379.335859772432;7382.114146302263;7161.57030578167;7235.421166306788;7257.600831954082;7307.013553170466;7342.3758980487255;6801.9319806801295;6944;6946.4095551876635;6950.061741665013;6968.442524597918;4734;4880.542856150143;4912.189488734319;4997.625178111583;5102.974485127551;4901.436334821398;4981.2030075187795;5017.54842064216;5050.621203409685;5133.92299115521 03:32:23 INFO - PROCESS | 1651 | |4;prototype.html;297.22720925593455;303.97112274333944;304.6953046953047;309.41211697774224;312.559291399127;4682.4849266580695;5225.477452254778;5229.947700522994;5234.7120908350025;5274.92087618685;4472.82108715651;4536.4783049949265;4959.536936603701;5149.253358263049;5149.639525233235;3488.058224279443;3684.6499582539614;3927.6465118139363;3927.9410808837893;4062.923325318793;3366.629670736217;4013.9598604014022;4034.253663072326;4039.333509970851;4081.1225586498895;3656.3784156693428;3732.533433320835;3994.62051105146;4010.8395664173545;4024.4768180136543;3326.301476689886;3414.3000684859544;3757.643023912724;3845.423186522044;4003.339448990913;3116.875324986998;3225.080851957181;3283.5731354923946;3487.442009278503;3498.320806013128;4233;4442.822287108512;5080.669756465818;5094.809232030226;5098.566621837148;3664.6885014773775;3998.300297447935;4567.7259364437905;4569.246074397721;4590.357349971006;4116.69124815637;4748.738819364934;5513.669179849222;5540.750666220029;5541.5289700375515;3605;3754.831032603512;3755.267722794056;3762.5861155272896;3765.8305376258136;5545.149866890429;5601.495865372095;5844.415558444164;5900.763969441217;5924;3099.2871639523037;3209.9839500802814;3720.534933133358;3797.981010094987;3820.9617903821163;3266.836658167082;3378.8141652208874;3422.982885085559;3838.7504812187117;3851.6340947609933;3526.4181410067563;3530.435130379127;4537.821845514171;4545.772711364419;4587.357769912215;5400.677708585346;5571.331440227199;5583.916241256385;5595.45406839895;5648.661080335193;1299.1880074953153;1320.2804471563022;1321.7620828250815;1324.417321301036;1325.3307079924577;720.4560556779597;724.655788500458;753.3634079203065;783.3185128937747;787.4527203593562;4313.978430107893;4425.911481770347;5136.383633963948;5274.630775845654;5334.91997620036;4889.117689689495;5688.8862222755315;5702.54379649627;5714.428557144335;5743.85640358986;4405.920549465402;4432.84485043022;4946.3817022872145;5208.531232189045;5260.842174734764;2332.696749422564;2963.3184367595572;2984.3884302476854;3000.354923691417;3000.4599172149224;4901.681390709592;5293.829529892725;5515.7242137892945;5837.6941108262845;5858.627255961343;5253.185756207794;5481.369642491085;5575.972120139373;5786.971065144731;5883.352831188566;4964.702117873011;5654.095344744821;5934.525237980951;5934.9109763354445;5966.403359663999;5016.2912027504735;5049;5237.685738855681;5537.750801213874;5716.828495145152;5275.997560463499;5556.944430555643;5602.439756024365;5631.802886898939;5632.887667124828;4407.823687052611;5055.16589762685;5668.348139963957;5918.408159184047;5931.673757943355;3227.338395628937;3511.367953768346;3538.9206292080135;3554.591222009502;3560.1989552350515;4778.709748367991;5582.8325150245555;5691.601587888808;5701.515371193495;5763.6541807491685;4908.680935739166;5582.720863956867;5583.357913839798;5614.466625670718;5619.297587801525;4601.539846015506;5502.642328248811;5543.8891222176135;5569.248151499496;5580.609357345109;4452.688311818141;5351.3043304370185;5413.53984911287;5437.755301011543;5488.792465657549;4416.939934415653;5443.564514838883;5472.661676377327;5504.366997795305;5546.223528706065;5431.9185212221055;5433.293671822637;5469.042917489344;5497.972510137423;5517.951589198039 03:32:23 INFO - PROCESS | 1651 | |5;yui.html;712.7327252280395;723.8009547374471;742.2132539508121;798.8601994650935;807.5679511461366;15200;15555.53333399997;15582.922085389557;15588.532344029669;15887.761683574756;13728.313584320795;13819.792703109437;13828.10117342372;13841.515546955834;13842.238676872768;669.9564528305644;690.9274526174754;695.5270416117038;696.5089611823652;823.9134890836451;684.6405637040543;688.5214775730869;819.9057108432547;853.7822855171922;858.4806192253691;898.3890954151175;905.6875377994614;911.9042500537447;913.0413066280412;915.5834095486571;901.2204443156688;903.3676426501443;903.3856977255464;904.8823652925078;905.4160066756938;527.4119356917048;674.4031532094083;674.9932500674979;675.0582936803181;676.2763842688325;12209.145359824815;13811;14390.208538530376;14414.99095063346;14721.263936803223;13232.574644395752;13419.932900335534;13608.31958402086;14418;14728.18994955277;11521.308721476738;11691.473883675255;11735.64793056201;11773;12024.278543287342;3749.1751814600743;3774.886753397375;3802.315583195024;3821.216650586623;3826.6747326477284;114602;115479.33904957162;116260;117189.41405293005;120084.39957800243;10955.726106847393;11050.723731906606;11159.218854680095;11239.269447485887;11350.659480215607;22665.4333641657;22712.318630441114;22733.545329093657;22784.772152278598;22817.657735133987;7731.613419329124;7996.280334769898;8125.593720313961;8129.552874591836;8145.79635509117;4275.786210689453;4441.755703436277;4506.233940230169;4536.977315113403;4540.72755634663;3567.554055743032;3619.1675914539805;3696.9260614787554;3699.7780133192095;3701.000729802938;675.3179288918228;675.5710124071251;677.4648028057779;691.1913061717802;691.4848437913787;537.492069993852;617.6417677746896;625.4496043481707;638.0142679560091;648.8572514046903;9059.773505662411;9528;9537.570809313598;9648;9656;534.3240800387513;633.1009965848506;654.2443477783168;656.3338211715113;687.9105716256954;3773.660370566662;4227.915441691211;4608.769561521911;4628.814847406066;4651.67438279324;126316;138279;140968;146065;149431.25284373725;63299.68350158312;78969;103080.48459757803;116587.8341216594;131926.34036829753;93229;104493.95506044994;117424;117982;121291.39354303172;9194.58624361892;9206.401583897294;9944.950275248577;9947.900520994697;10001.299649094559;44860.10279794451;54275;58067.128993065984;62950.6852465753;63184;71474.64262678653;90594.67566554181;93685.06314936763;95060;96439.51780241054;11758.235714678518;13457;13473.393697283449;13530.72938541204;13900.51348202808;13768.862311376757;14399.78400323975;14573.48222051125;14623.634409139857;15148.318325675591;13760.93119534396;13977.44090236379;14209.786853197003;14306.928465357607;14370.13779173253;12490;12792.872071279167;12978.480860765463;13117.475300987853;13641.610409598225;12030.458629361525;12692.809607856074;13286.734265314833;13813;14078;10920.508577114208;11211.60759373418;11241.775164496828;11661.883381166079;11854.822177667169;9303.953480232827;11345.943270283597;11537.48081336325;11650.475728592064;11737.35444550558 03:32:23 INFO - PROCESS | 1651 | __end_tp_report 03:32:23 INFO - PROCESS | 1651 | __start_cc_report 03:32:23 INFO - PROCESS | 1651 | _x_x_mozilla_cycle_collect,1582 03:32:23 INFO - PROCESS | 1651 | __end_cc_report 03:32:23 INFO - PROCESS | 1651 | __startTimestamp1476354743503__endTimestamp 03:32:23 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | ------- Summary: start ------- 03:32:23 INFO - PROCESS | 1651 | Number of tests: 6 03:32:23 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | [#0] dojo.html Cycles:165 Average:5635.53 Median:5798.22 stddev:625.80 (10.8%) stddev-sans-first:600.48 03:32:23 INFO - PROCESS | 1651 | Values: 3307.5 3311.8 3313.0 3336.4 3373.9 5514.2 5606.0 5613.4 5656.8 5668.8 5562.8 5601.4 5604.0 5610.2 5627.1 5062.4 5112.2 5123.5 5152.6 5156.8 5186.3 5210.2 5212.4 5212.7 5215.1 5132.7 5177.5 5183.3 5200.0 5204.5 5189.5 5219.1 5227.9 5231.7 5296.3 5024.7 5024.9 5059.4 5114.9 5142.8 5554.7 5561.0 5589.2 5610.4 5638.5 6088.1 6096.5 6112.6 6113.6 6118.4 5741.4 5967.1 6095.7 6122.7 6175.3 5634.9 5643.2 5652.7 5686.0 5692.1 6274.5 6298.2 6315.8 6320.5 6329.7 5730.5 5798.2 5837.5 5889.1 5952.9 6036.7 6040.9 6054.8 6055.6 6058.8 5005.7 5924.0 5973.7 6016.7 6067.9 6069.2 6087.8 6088.0 6089.6 6111.2 4841.5 4843.7 4848.5 4854.5 4900.6 4290.7 4312.7 4331.6 4367.4 4385.8 5548.5 5589.8 5590.0 5602.6 5642.4 6106.3 6125.1 6136.8 6156.2 6160.8 5414.5 5569.5 5583.6 5594.6 5599.9 5232.8 5264.6 5291.4 5323.1 5330.0 6342.1 6372.6 6373.6 6376.2 6378.3 6126.8 6143.7 6169.1 6177.4 6183.5 6135.9 6282.6 6302.5 6303.2 6349.1 5991.2 6094.9 6112.0 6115.1 6121.7 6135.6 6137.6 6140.1 6148.4 6155.0 4859.8 5908.8 6007.2 6024.9 6033.3 5806.3 5897.3 5900.5 5964.8 6025.4 5873.3 5874.6 5875.2 5889.6 5910.9 5973.5 6019.7 6028.6 6030.3 6043.8 5622.5 5668.2 5769.4 5857.6 5886.4 03:32:23 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | [#1] ext.html Cycles:180 Average:71086.58 Median:41231.88 stddev:156103.60 (378.6%) stddev-sans-first:156451.51 03:32:23 INFO - PROCESS | 1651 | Values: 485.9 520.8 533.1 555.0 564.3 30267.5 39798.8 41223.8 41240.0 43493.1 33490.7 34876.5 42016.6 42612.0 42651.8 9454.3 9638.4 9641.7 9646.4 9686.4 9557.1 9656.8 9657.8 9663.5 9667.5 9625.0 9682.2 9682.8 9703.0 9714.2 9577.5 9632.3 9641.4 9649.3 9661.2 9337.6 9341.1 9425.6 9509.9 9515.2 40417.6 40792.6 40810.8 40876.2 40923.4 3231.0 3304.3 3320.6 3716.7 3888.0 30133.9 30397.4 30944.0 31096.5 31999.7 3176.0 3178.3 3229.2 3274.2 3309.5 494878.0 495088.0 497114.0 498866.0 510831.0 61435.5 61710.0 61787.0 61854.4 61869.4 29424.9 34299.7 34586.5 65209.0 65590.3 16245.5 16404.3 16411.4 16418.6 16422.8 12535.1 12627.8 12652.4 12653.8 12663.1 18954.5 18975.9 18981.7 18995.7 19003.0 7589.8 7720.3 7745.1 7781.8 7854.1 879.5 898.8 967.4 998.3 1004.5 28765.7 29667.6 29853.7 30550.2 30733.7 865.8 985.7 1014.9 1043.9 1104.3 15354.0 15357.0 15535.5 15599.8 15815.4 682334.0 685763.0 685987.0 688007.0 691770.0 57277.9 57758.4 57829.7 57862.0 57881.4 1035.4 1220.6 1308.3 1319.1 1321.1 28731.9 29675.1 30730.7 32115.0 32576.8 50525.7 51702.2 51763.7 51772.2 51822.0 538263.0 541374.0 551528.0 555909.0 557648.0 42457.4 42990.4 43829.9 43918.8 43946.1 47577.0 48287.8 48777.3 48857.0 48875.5 38964.4 39507.8 39565.0 40245.3 41564.0 39073.0 39219.8 39527.4 40447.4 40695.0 38587.6 38962.0 39395.0 39460.8 40050.2 26662.5 30475.1 30706.4 32299.0 33630.3 22228.0 25427.9 25605.9 26121.2 26341.3 03:32:23 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | [#2] jquery.html Cycles:180 Average:33315.29 Median:4457.19 stddev:97540.28 (2188.4%) stddev-sans-first:97782.52 03:32:23 INFO - PROCESS | 1651 | Values: 358.7 375.5 381.7 387.1 412.3 14979.3 15359.3 17590.2 20192.1 20226.2 20146.7 20193.4 20806.9 20834.5 21056.3 4876.2 5706.9 5780.4 6004.9 6022.4 5755.5 5947.3 5958.1 5961.4 5970.8 5655.7 5781.4 5871.2 5892.7 5895.7 5799.8 5856.8 5867.3 5872.9 5874.9 4886.0 5086.0 5124.6 5143.1 5153.8 25187.0 25889.2 25934.9 25966.7 26338.1 2398.8 2401.1 2411.6 2656.1 2781.4 9358.7 9912.4 9934.4 15615.4 16020.0 1838.6 1873.0 1882.7 1911.9 1970.4 104039.0 118734.0 124135.0 125032.0 125868.4 10905.9 11016.2 11425.3 11458.0 11650.3 14416.9 14420.4 14430.9 14459.4 14460.7 7467.0 8027.7 8238.7 8247.0 8368.9 7289.4 7812.8 7899.0 8180.3 8447.7 4445.7 4468.6 4469.6 4482.2 4538.5 1609.4 1861.4 1899.7 1903.1 1912.1 760.0 784.9 828.7 838.1 890.1 20476.0 21209.0 21303.1 21340.4 21483.0 905.6 909.2 926.9 982.7 1019.6 9335.2 10520.4 11105.1 11157.0 11170.8 555379.0 580215.0 592664.0 599935.0 613128.9 55564.0 64031.0 71604.2 80782.0 134007.0 855.6 907.1 938.9 957.5 959.8 17007.4 18251.7 18425.4 18449.7 18528.0 50910.7 51490.7 52174.0 52208.0 53391.2 73830.0 74184.0 77065.0 77637.6 78188.2 6670.8 7841.0 7947.4 8071.6 8306.9 11900.3 12785.6 13026.1 13119.7 13128.9 11221.2 11394.7 11548.2 11615.5 11646.9 11103.2 11109.6 11299.0 11534.4 11561.9 9216.6 9692.9 10516.9 11578.0 11752.5 6815.9 7211.4 7220.2 7460.0 8463.2 9296.4 10657.8 10936.1 10965.4 11170.7 03:32:23 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | [#3] mootools.html Cycles:180 Average:5541.11 Median:4655.31 stddev:3179.43 (68.3%) stddev-sans-first:3171.84 03:32:23 INFO - PROCESS | 1651 | Values: 1229.5 1266.4 1457.5 1607.7 1887.5 7778.8 8254.9 8258.3 8268.3 8270.4 7508.3 8124.8 8361.4 8410.8 8677.7 2287.7 2309.9 2354.6 2356.3 2356.8 2021.5 2299.4 2348.2 2350.8 2352.8 2297.4 2320.8 2329.2 2336.1 2338.6 2280.7 2306.3 2312.4 2313.2 2319.5 2300.9 2308.6 2310.4 2312.0 2313.1 8698.3 8779.8 8804.7 8821.9 8850.6 5126.4 5192.5 5356.6 5367.1 5367.4 3551.3 3646.3 3647.3 3650.8 3651.9 1045.8 1053.1 1067.8 1078.8 1080.4 11342.3 11428.5 11434.4 11443.7 11488.1 4302.3 4325.5 4369.6 4394.7 4562.9 9000.6 9015.0 9017.0 9037.7 9038.0 5066.3 5070.0 5070.5 5073.0 5100.8 4121.4 4415.6 4507.4 4576.6 4745.9 3688.6 3697.6 3741.6 3761.4 3765.4 1130.2 1139.8 1145.8 1147.4 1150.3 770.8 862.6 865.6 871.1 878.9 5330.3 5363.2 5484.6 5527.9 5660.0 387.5 421.5 431.1 439.4 441.6 3455.5 3633.2 3653.6 3707.4 3716.6 10385.1 10875.0 10907.6 10921.3 10944.8 10838.6 10849.1 10858.7 10870.2 10884.0 8168.0 8259.7 8261.8 8265.2 8265.7 5281.2 5417.3 5507.4 5510.3 5532.7 9768.8 10049.6 10110.7 10124.0 10143.8 9293.8 9952.1 10093.3 10225.6 10339.7 5767.3 6593.6 6715.8 6920.3 7032.4 8137.9 8149.9 8163.8 8198.0 8252.2 7327.2 7332.5 7359.3 7379.3 7382.1 7161.6 7235.4 7257.6 7307.0 7342.4 6801.9 6944.0 6946.4 6950.1 6968.4 4734.0 4880.5 4912.2 4997.6 5103.0 4901.4 4981.2 5017.5 5050.6 5133.9 03:32:23 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | [#4] prototype.html Cycles:180 Average:4398.56 Median:4962.12 stddev:1401.73 (28.2%) stddev-sans-first:1371.44 03:32:23 INFO - PROCESS | 1651 | Values: 297.2 304.0 304.7 309.4 312.6 4682.5 5225.5 5229.9 5234.7 5274.9 4472.8 4536.5 4959.5 5149.3 5149.6 3488.1 3684.6 3927.6 3927.9 4062.9 3366.6 4014.0 4034.3 4039.3 4081.1 3656.4 3732.5 3994.6 4010.8 4024.5 3326.3 3414.3 3757.6 3845.4 4003.3 3116.9 3225.1 3283.6 3487.4 3498.3 4233.0 4442.8 5080.7 5094.8 5098.6 3664.7 3998.3 4567.7 4569.2 4590.4 4116.7 4748.7 5513.7 5540.8 5541.5 3605.0 3754.8 3755.3 3762.6 3765.8 5545.1 5601.5 5844.4 5900.8 5924.0 3099.3 3210.0 3720.5 3798.0 3821.0 3266.8 3378.8 3423.0 3838.8 3851.6 3526.4 3530.4 4537.8 4545.8 4587.4 5400.7 5571.3 5583.9 5595.5 5648.7 1299.2 1320.3 1321.8 1324.4 1325.3 720.5 724.7 753.4 783.3 787.5 4314.0 4425.9 5136.4 5274.6 5334.9 4889.1 5688.9 5702.5 5714.4 5743.9 4405.9 4432.8 4946.4 5208.5 5260.8 2332.7 2963.3 2984.4 3000.4 3000.5 4901.7 5293.8 5515.7 5837.7 5858.6 5253.2 5481.4 5576.0 5787.0 5883.4 4964.7 5654.1 5934.5 5934.9 5966.4 5016.3 5049.0 5237.7 5537.8 5716.8 5276.0 5556.9 5602.4 5631.8 5632.9 4407.8 5055.2 5668.3 5918.4 5931.7 3227.3 3511.4 3538.9 3554.6 3560.2 4778.7 5582.8 5691.6 5701.5 5763.7 4908.7 5582.7 5583.4 5614.5 5619.3 4601.5 5502.6 5543.9 5569.2 5580.6 4452.7 5351.3 5413.5 5437.8 5488.8 4416.9 5443.6 5472.7 5504.4 5546.2 5431.9 5433.3 5469.0 5498.0 5518.0 03:32:23 INFO - PROCESS | 1651 | 03:32:23 INFO - PROCESS | 1651 | [#5] yui.html Cycles:180 Average:23781.92 Median:3700.39 stddev:37451.93 (1012.1%) stddev-sans-first:37516.94 03:32:23 INFO - PROCESS | 1651 | Values: 712.7 723.8 742.2 798.9 807.6 15200.0 15555.5 15582.9 15588.5 15887.8 13728.3 13819.8 13828.1 13841.5 13842.2 670.0 690.9 695.5 696.5 823.9 684.6 688.5 819.9 853.8 858.5 898.4 905.7 911.9 913.0 915.6 901.2 903.4 903.4 904.9 905.4 527.4 674.4 675.0 675.1 676.3 12209.1 13811.0 14390.2 14415.0 14721.3 13232.6 13419.9 13608.3 14418.0 14728.2 11521.3 11691.5 11735.6 11773.0 12024.3 3749.2 3774.9 3802.3 3821.2 3826.7 114602.0 115479.3 116260.0 117189.4 120084.4 10955.7 11050.7 11159.2 11239.3 11350.7 22665.4 22712.3 22733.5 22784.8 22817.7 7731.6 7996.3 8125.6 8129.6 8145.8 4275.8 4441.8 4506.2 4537.0 4540.7 3567.6 3619.2 3696.9 3699.8 3701.0 675.3 675.6 677.5 691.2 691.5 537.5 617.6 625.4 638.0 648.9 9059.8 9528.0 9537.6 9648.0 9656.0 534.3 633.1 654.2 656.3 687.9 3773.7 4227.9 4608.8 4628.8 4651.7 126316.0 138279.0 140968.0 146065.0 149431.3 63299.7 78969.0 103080.5 116587.8 131926.3 93229.0 104494.0 117424.0 117982.0 121291.4 9194.6 9206.4 9945.0 9947.9 10001.3 44860.1 54275.0 58067.1 62950.7 63184.0 71474.6 90594.7 93685.1 95060.0 96439.5 11758.2 13457.0 13473.4 13530.7 13900.5 13768.9 14399.8 14573.5 14623.6 15148.3 13760.9 13977.4 14209.8 14306.9 14370.1 12490.0 12792.9 12978.5 13117.5 13641.6 12030.5 12692.8 13286.7 13813.0 14078.0 10920.5 11211.6 11241.8 11661.9 11854.8 9304.0 11345.9 11537.5 11650.5 11737.4 03:32:23 INFO - PROCESS | 1651 | -------- Summary: end -------- 03:32:23 INFO - PROCESS | 1651 | 03:32:24 INFO - TEST-INFO | 1651: exit 0 03:32:24 INFO - TEST-OK | dromaeo_css | took 1118532ms 03:32:24 INFO - TEST-START | kraken 03:32:24 INFO - operating with platform_type : mac_ 03:32:24 INFO - Initialising browser for kraken test... 03:32:24 INFO - TEST-INFO | started process 1662 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/tmpyLCfAL/profile http://localhost:49277/getInfo.html) 03:32:26 INFO - PROCESS | 1662 | __metrics Screen width/height:1600/1200 03:32:26 INFO - PROCESS | 1662 | colorDepth:24 03:32:26 INFO - PROCESS | 1662 | Browser inner width/height: 1024/689 03:32:26 INFO - PROCESS | 1662 | __metrics 03:32:26 INFO - PROCESS | 1662 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 03:32:26 INFO - PROCESS | 1662 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:32:27 INFO - TEST-INFO | 1662: exit 0 03:32:27 INFO - Browser initialized. 03:32:27 INFO - Running cycle 1/1 for kraken test... 03:32:27 INFO - TEST-INFO | started process 1663 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/T/tmpyLCfAL/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:32:39 INFO - PROCESS | 1663 | RSS: Main: 235143168 03:32:39 INFO - PROCESS | 1663 | 03:32:42 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49277/tests/kraken/driver.html?testName=audio-beat-detection) 03:32:42 INFO - PROCESS | 1663 | RSS: Main: 293359616 03:32:42 INFO - PROCESS | 1663 | 03:32:45 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49277/tests/kraken/driver.html?testName=audio-dft) 03:32:46 INFO - PROCESS | 1663 | RSS: Main: 294301696 03:32:46 INFO - PROCESS | 1663 | 03:32:49 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49277/tests/kraken/driver.html?testName=audio-fft) 03:32:50 INFO - PROCESS | 1663 | RSS: Main: 383721472 03:32:50 INFO - PROCESS | 1663 | 03:32:52 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49277/tests/kraken/driver.html?testName=audio-oscillator) 03:32:52 INFO - PROCESS | 1663 | RSS: Main: 288886784 03:32:52 INFO - PROCESS | 1663 | 03:32:54 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49277/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:32:55 INFO - PROCESS | 1663 | RSS: Main: 291409920 03:32:55 INFO - PROCESS | 1663 | 03:32:58 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49277/tests/kraken/driver.html?testName=imaging-darkroom) 03:32:58 INFO - PROCESS | 1663 | RSS: Main: 329322496 03:32:58 INFO - PROCESS | 1663 | 03:33:01 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49277/tests/kraken/driver.html?testName=imaging-desaturate) 03:33:02 INFO - PROCESS | 1663 | RSS: Main: 329551872 03:33:02 INFO - PROCESS | 1663 | 03:33:05 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49277/tests/kraken/driver.html?testName=json-parse-financial) 03:33:05 INFO - PROCESS | 1663 | RSS: Main: 326725632 03:33:05 INFO - PROCESS | 1663 | 03:33:07 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49277/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:33:07 INFO - PROCESS | 1663 | RSS: Main: 301654016 03:33:07 INFO - PROCESS | 1663 | 03:33:09 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:33:10 INFO - PROCESS | 1663 | RSS: Main: 304787456 03:33:10 INFO - PROCESS | 1663 | 03:33:12 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:33:13 INFO - PROCESS | 1663 | RSS: Main: 307597312 03:33:13 INFO - PROCESS | 1663 | 03:33:16 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:33:16 INFO - PROCESS | 1663 | RSS: Main: 323776512 03:33:16 INFO - PROCESS | 1663 | 03:33:19 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:33:20 INFO - PROCESS | 1663 | RSS: Main: 317161472 03:33:20 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49277/tests/kraken/driver.html?testName=ai-astar) 03:33:22 INFO - PROCESS | 1663 | RSS: Main: 361021440 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | __start_tp_report 03:33:22 INFO - PROCESS | 1663 | _x_x_mozilla_page_load 03:33:22 INFO - PROCESS | 1663 | _x_x_mozilla_page_load_details 03:33:22 INFO - PROCESS | 1663 | |i|pagename|runs| 03:33:22 INFO - PROCESS | 1663 | |0;ai-astar;114;115;114;115;115;114;114;114;115;114 03:33:22 INFO - PROCESS | 1663 | |1;audio-beat-detection;149;117;107;190;143;142;142;111;144;111 03:33:22 INFO - PROCESS | 1663 | |2;audio-dft;183;184;183;191;184;185;179;182;183;182 03:33:22 INFO - PROCESS | 1663 | |3;audio-fft;77;58;58;86;58;58;59;58;82;58 03:33:22 INFO - PROCESS | 1663 | |4;audio-oscillator;83;72;94;71;69;69;92;68;69;91 03:33:22 INFO - PROCESS | 1663 | |5;imaging-gaussian-blur;87;85;88;84;86;84;89;84;87;84 03:33:22 INFO - PROCESS | 1663 | |6;imaging-darkroom;107;150;108;93;92;92;92;93;93;93 03:33:22 INFO - PROCESS | 1663 | |7;imaging-desaturate;84;84;87;85;86;86;87;84;85;87 03:33:22 INFO - PROCESS | 1663 | |8;json-parse-financial;55;54;54;53;53;56;54;52;55;56 03:33:22 INFO - PROCESS | 1663 | |9;json-stringify-tinderbox;64;66;75;75;73;70;68;69;69;72 03:33:22 INFO - PROCESS | 1663 | |10;stanford-crypto-aes;85;86;89;87;86;86;85;86;90;86 03:33:22 INFO - PROCESS | 1663 | |11;stanford-crypto-ccm;146;144;146;144;155;149;153;147;183;146 03:33:22 INFO - PROCESS | 1663 | |12;stanford-crypto-pbkdf2;171;174;172;170;171;172;173;166;172;169 03:33:22 INFO - PROCESS | 1663 | |13;stanford-crypto-sha256-iterative;69;67;69;70;68;70;68;69;68;68 03:33:22 INFO - PROCESS | 1663 | __end_tp_report 03:33:22 INFO - PROCESS | 1663 | __start_cc_report 03:33:22 INFO - PROCESS | 1663 | _x_x_mozilla_cycle_collect,1966 03:33:22 INFO - PROCESS | 1663 | __end_cc_report 03:33:22 INFO - PROCESS | 1663 | __startTimestamp1476354802340__endTimestamp 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | ------- Summary: start ------- 03:33:22 INFO - PROCESS | 1663 | Number of tests: 14 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#0] ai-astar Cycles:10 Average:114.40 Median:114.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 03:33:22 INFO - PROCESS | 1663 | Values: 114.0 115.0 114.0 115.0 115.0 114.0 114.0 114.0 115.0 114.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#1] audio-beat-detection Cycles:10 Average:135.60 Median:142.50 stddev:25.21 (17.7%) stddev-sans-first:26.27 03:33:22 INFO - PROCESS | 1663 | Values: 149.0 117.0 107.0 190.0 143.0 142.0 142.0 111.0 144.0 111.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#2] audio-dft Cycles:10 Average:183.60 Median:183.50 stddev:3.06 (1.7%) stddev-sans-first:3.24 03:33:22 INFO - PROCESS | 1663 | Values: 183.0 184.0 183.0 191.0 184.0 185.0 179.0 182.0 183.0 182.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#3] audio-fft Cycles:10 Average:65.20 Median:58.50 stddev:11.56 (19.8%) stddev-sans-first:11.45 03:33:22 INFO - PROCESS | 1663 | Values: 77.0 58.0 58.0 86.0 58.0 58.0 59.0 58.0 82.0 58.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#4] audio-oscillator Cycles:10 Average:77.80 Median:77.50 stddev:10.92 (14.1%) stddev-sans-first:11.42 03:33:22 INFO - PROCESS | 1663 | Values: 83.0 72.0 94.0 71.0 69.0 69.0 92.0 68.0 69.0 91.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#5] imaging-gaussian-blur Cycles:10 Average:85.80 Median:86.50 stddev:1.87 (2.2%) stddev-sans-first:1.94 03:33:22 INFO - PROCESS | 1663 | Values: 87.0 85.0 88.0 84.0 86.0 84.0 89.0 84.0 87.0 84.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#6] imaging-darkroom Cycles:10 Average:101.30 Median:92.50 stddev:18.21 (19.7%) stddev-sans-first:19.20 03:33:22 INFO - PROCESS | 1663 | Values: 107.0 150.0 108.0 93.0 92.0 92.0 92.0 93.0 93.0 93.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#7] imaging-desaturate Cycles:10 Average:85.50 Median:86.00 stddev:1.27 (1.5%) stddev-sans-first:1.22 03:33:22 INFO - PROCESS | 1663 | Values: 84.0 84.0 87.0 85.0 86.0 86.0 87.0 84.0 85.0 87.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#8] json-parse-financial Cycles:10 Average:54.20 Median:54.50 stddev:1.32 (2.4%) stddev-sans-first:1.36 03:33:22 INFO - PROCESS | 1663 | Values: 55.0 54.0 54.0 53.0 53.0 56.0 54.0 52.0 55.0 56.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#9] json-stringify-tinderbox Cycles:10 Average:70.10 Median:71.00 stddev:3.67 (5.2%) stddev-sans-first:3.15 03:33:22 INFO - PROCESS | 1663 | Values: 64.0 66.0 75.0 75.0 73.0 70.0 68.0 69.0 69.0 72.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#10] stanford-crypto-aes Cycles:10 Average:86.60 Median:86.00 stddev:1.65 (1.9%) stddev-sans-first:1.64 03:33:22 INFO - PROCESS | 1663 | Values: 85.0 86.0 89.0 87.0 86.0 86.0 85.0 86.0 90.0 86.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#11] stanford-crypto-ccm Cycles:10 Average:151.30 Median:148.00 stddev:11.72 (7.9%) stddev-sans-first:12.27 03:33:22 INFO - PROCESS | 1663 | Values: 146.0 144.0 146.0 144.0 155.0 149.0 153.0 147.0 183.0 146.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.00 Median:172.00 stddev:2.26 (1.3%) stddev-sans-first:2.40 03:33:22 INFO - PROCESS | 1663 | Values: 171.0 174.0 172.0 170.0 171.0 172.0 173.0 166.0 172.0 169.0 03:33:22 INFO - PROCESS | 1663 | 03:33:22 INFO - PROCESS | 1663 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.60 Median:69.00 stddev:0.97 (1.4%) stddev-sans-first:1.01 03:33:22 INFO - PROCESS | 1663 | Values: 69.0 67.0 69.0 70.0 68.0 70.0 68.0 69.0 68.0 68.0 03:33:22 INFO - PROCESS | 1663 | -------- Summary: end -------- 03:33:22 INFO - PROCESS | 1663 | 03:33:23 INFO - TEST-INFO | 1663: exit 0 03:33:23 INFO - TEST-OK | kraken | took 59116ms 03:33:23 INFO - SUITE-END | took 1177s 03:33:23 INFO - Completed test suite (00:19:37) 03:33:23 INFO - javascript benchmark 03:33:23 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3307.5038744188373, 3311.7847339922905, 3312.9668703312973, 3336.4494858348376, 3373.932521349573, 5514.172874068881, 5606.0, 5613.43865613439, 5656.802011929583, 5668.773249070043, 5562.7774889004395, 5601.411851755568, 5604.019296623085, 5610.214569960209, 5627.099664053752, 5062.392512898448, 5112.207607820775, 5123.5388815006645, 5152.587792976572, 5156.845294641167, 5186.273921650972, 5210.218467229927, 5212.400573933989, 5212.6611770235, 5215.113430716788, 5132.666376685504, 5177.48225177483, 5183.2743415921805, 5199.974000129994, 5204.505571970676, 5189.455107213726, 5219.11275083233, 5227.895442091137, 5231.65994210377, 5296.3379577552805, 5024.673396229234, 5024.874378140539, 5059.367579052619, 5114.872128196787, 5142.845714628567, 5554.694491802949, 5560.972195139039, 5589.217509548666, 5610.382857885629, 5638.548916086703, 6088.1476593276975, 6096.542759293026, 6112.602680825732, 6113.602615830001, 6118.418750218722, 5741.425857414267, 5967.104934259853, 6095.664738439384, 6122.693865306762, 6175.258968923713, 5634.943650563524, 5643.238162848045, 5652.66084034951, 5686.0, 5692.060809966392, 6274.529410294155, 6298.1812364392335, 6315.810525684236, 6320.525960552977, 6329.715162817684, 5730.455606717439, 5798.217240672539, 5837.532997360201, 5889.057750759858, 5952.85117872048, 6036.698165091728, 6040.879182416327, 6054.788082417094, 6055.576109672369, 6058.818235452944, 5005.74971251436, 5924.0, 5973.731182096729, 6016.729247183887, 6067.878642427127, 6069.241344831896, 6087.817365478954, 6087.969560152171, 6089.634621922699, 6111.236095488064, 4841.491643377465, 4843.709377437365, 4848.466668666444, 4854.514548545118, 4900.583450406755, 4290.699651024398, 4312.741235525816, 4331.610155086058, 4367.388565600819, 4385.802638881258, 5548.528375088082, 5589.804356847572, 5589.972050139804, 5602.579806514446, 5642.379338272786, 6106.328303886569, 6125.142480052797, 6136.754529818846, 6156.230471191101, 6160.753569857246, 5414.458554144554, 5569.498745112959, 5583.553315734732, 5594.636348637326, 5599.8600034998635, 5232.816851410183, 5264.6051546134195, 5291.417944026231, 5323.148296272655, 5329.973350133302, 6342.112104305494, 6372.55392122547, 6373.553851230369, 6376.171097757448, 6378.330275321025, 6126.846828829315, 6143.662098584621, 6169.105479705508, 6177.413145751147, 6183.4541364658835, 6135.93706321624, 6282.591631543935, 6302.527310451826, 6303.180586523723, 6349.142865713255, 5991.161237426851, 6094.939050609437, 6111.96944015277, 6115.143879856734, 6121.663308518075, 6135.570510064253, 6137.631742095488, 6140.140380346666, 6148.44663980244, 6155.0, 4859.757012149449, 5908.763649453974, 6007.219061522149, 6024.9397506026135, 6033.3061697905305, 5806.303243610793, 5897.292324921037, 5900.527957763283, 5964.821055368346, 6025.397460253939, 5873.324567674772, 5874.647521148745, 5875.20684707559, 5889.587728858939, 5910.940890591211, 5973.49225315853, 6019.668918209541, 6028.608140470856, 6030.276366836008, 6043.7884674036195, 5622.493975542221, 5668.234788303691, 5769.394213607511, 5857.58996870215, 5886.411358864079], "value": 5595.972828737752, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [485.8688154198369, 520.7942862569284, 533.1123679074342, 554.9556035517157, 564.2861779848492, 30267.545986810186, 39798.80603581893, 41223.79388103059, 41239.969000774996, 43493.13013739723, 33490.66509334906, 34876.47685284723, 42016.57983420165, 42612.0, 42651.78674106633, 9454.29092818038, 9638.373505722106, 9641.662541811038, 9646.372985755903, 9686.418814871095, 9557.09207625278, 9656.75858103546, 9657.758556036086, 9663.468509231989, 9667.468289244089, 9624.951875240615, 9682.225421966226, 9682.757931051745, 9703.0, 9714.22286217101, 9577.521123943776, 9632.27757918159, 9641.421514709069, 9649.276304277173, 9661.246544734717, 9337.626494940194, 9341.065893410605, 9425.575849086808, 9509.857352139723, 9515.23878089758, 40417.59582404168, 40792.59207407918, 40810.79594602008, 40876.18247635031, 40923.386149207785, 3231.0, 3304.273059926812, 3320.634730179678, 3716.6655001049767, 3888.0279930017496, 30133.945311913976, 30397.392052158833, 30944.0, 31096.533551996738, 31999.680003199905, 3175.9682403175902, 3178.332550164468, 3229.2088438332758, 3274.2141885947203, 3309.5366648668964, 494878.0, 495087.9999999964, 497114.0, 498866.0, 510831.0, 61435.46411339663, 61710.0, 61787.0, 61854.381456185765, 61869.381306187264, 29424.852875735483, 34299.65700343015, 34586.48120278198, 65209.0, 65590.34409655938, 16245.51263462098, 16404.26180821866, 16411.42560010394, 16418.589535261715, 16422.75365869513, 12535.059870509749, 12627.810582841264, 12652.430640621194, 12653.810192847115, 12663.050271229695, 18954.526136846413, 18975.90512047431, 18981.715274270897, 18995.715064274045, 19003.0, 7589.848203035908, 7720.3437707795465, 7745.10931242903, 7781.832725091282, 7854.096778870388, 879.5030807593689, 898.7528429681759, 967.4437198610827, 998.2962011781676, 1004.4776716107583, 28765.712342876723, 29667.554986675215, 29853.701462985093, 30550.236244094074, 30733.69266307353, 865.7835541114721, 985.669800616787, 1014.8579198912158, 1043.8903915088958, 1104.276698762312, 15354.0, 15357.0, 15535.532335724169, 15599.844001559839, 15815.367385304458, 682334.0, 685763.0, 685987.0, 688007.0, 691770.0, 57277.85444291091, 57758.422415775305, 57829.710851445474, 57862.0, 57881.421185788444, 1035.3684252605904, 1220.5544976083665, 1308.2673702726504, 1319.1425573377383, 1321.0686466041225, 28731.85634071816, 29675.109746707632, 30730.692693072782, 32115.0, 32576.83711581427, 50525.73685657888, 51702.22446663228, 51763.74118129385, 51772.22341664953, 51822.0, 538263.0, 541374.0, 551528.0, 555909.0, 557648.0, 42457.36313955231, 42990.35514467223, 43829.90425239394, 43918.780406097765, 43946.12107757891, 47577.0, 48287.75856120697, 48777.2683409742, 48857.02285954332, 48875.51124488709, 38964.41553376645, 39507.802460987514, 39565.0, 40245.26920337385, 41564.01231852197, 39073.023174420865, 39219.82340529789, 39527.40708889312, 40447.393289101274, 40694.982625434604, 38587.6141238584, 38962.0, 39395.0, 39460.81617551478, 40050.1989960205, 26662.466750665266, 30475.085747427613, 30706.385872282877, 32299.031029069167, 33630.327393452484, 22228.0, 25427.87286063558, 25605.871970640026, 26121.216363509124, 26341.34146646349], "value": 20074.651233076704, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [358.7130295763392, 375.52496092443045, 381.728972429575, 387.103854576655, 412.2908597212793, 14979.325930333134, 15359.308831102599, 17590.208440620172, 20192.091355888984, 20226.190952361925, 20146.69779953302, 20193.394198174043, 20806.89596552015, 20834.479138021557, 21056.263030793885, 4876.195427754416, 5706.857328566788, 5780.421957804228, 6004.909926351108, 6022.367651396606, 5755.539556835464, 5947.256592925884, 5958.136070269808, 5961.403859614047, 5970.79102231422, 5655.688937108457, 5781.386633354154, 5871.2073870027425, 5892.675902825343, 5895.675737834439, 5799.768009279624, 5856.824295271149, 5867.295924489046, 5872.882542349151, 5874.853128671774, 4886.0, 5086.0, 5124.564412024983, 5143.074246635604, 5153.768080436389, 25187.0, 25889.22332330033, 25934.87032564844, 25966.74033259681, 26338.078167264055, 2398.832081754278, 2401.147592604635, 2411.602085655865, 2656.1102030819698, 2781.443711257736, 9358.672446464341, 9912.355696879751, 9934.403935763878, 15615.375384984587, 16020.0, 1838.6138910828743, 1872.9812701872943, 1882.717592361143, 1911.9044047797693, 1970.3596331192277, 104039.0, 118734.0, 124135.0, 125032.0, 125868.37065814703, 10905.945470272598, 11016.228863979604, 11425.257358271685, 11458.026067784333, 11650.30098194111, 14416.927915360357, 14420.351084201237, 14430.917681173954, 14459.421623135167, 14460.710785784226, 7466.991956085967, 8027.6788928443375, 8238.670453181805, 8246.958765206256, 8368.916310836936, 7289.432771954055, 7812.843743125106, 7899.0, 8180.304674102649, 8447.704330348408, 4445.73325600465, 4468.642508599304, 4469.553044695569, 4482.193205223091, 4538.546145385501, 1609.4286528282291, 1861.4322631597222, 1899.7435346228083, 1903.0770076513156, 1912.149093653311, 759.9620018999028, 784.901887264092, 828.6561077152915, 838.1325328285195, 890.0832142892831, 20476.0, 21209.0, 21303.147874085174, 21340.359789206348, 21483.0, 905.5653286422422, 909.1953621045423, 926.8980412154658, 982.6806287956442, 1019.5819713917258, 9335.206507446806, 10520.421376824348, 11105.05607023412, 11157.047516684548, 11170.776584468265, 555379.0, 580215.0, 592664.0366798139, 599935.0, 613128.9343553254, 55564.0, 64031.0, 71604.209894752, 80782.0, 134007.0, 855.619249433996, 907.1291560102244, 938.8920274168559, 957.4973139101888, 959.8464245720791, 17007.404740834507, 18251.726224106915, 18425.447236582924, 18449.723254151468, 18528.0, 50910.74544627253, 51490.74254628703, 52174.0, 52207.95584088373, 53391.199132012276, 73830.0, 74184.0, 77065.0, 77637.61181194057, 78188.21811781809, 6670.799876003728, 7840.980672512537, 7947.403944704286, 8071.596420179085, 8306.875396869173, 11900.285982841056, 12785.552505662257, 13026.08817382774, 13119.672008199872, 13128.868711312765, 11221.214514983873, 11394.658160255205, 11548.18909759794, 11615.535378584762, 11646.94176529112, 11103.16726245551, 11109.611163609236, 11299.0, 11534.423278835857, 11561.942190289332, 9216.585253663736, 9692.9030709692, 10516.894831051592, 11578.015868650922, 11752.529898803952, 6815.93184068153, 7211.3870321023305, 7220.1696804866015, 7460.0301960744755, 8463.153684631734, 9296.442213467213, 10657.786844263226, 10936.121206682748, 10965.396903170402, 11170.664880053611], "value": 9307.941408183893, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1229.4836168809102, 1266.366816591704, 1457.4753088887999, 1607.742761158215, 1887.5469887227061, 7778.805529861749, 8254.876176857337, 8258.339332853373, 8268.255856972879, 8270.37972152088, 7508.286712762292, 8124.756257312275, 8361.414700970934, 8410.789730256747, 8677.69628063018, 2287.7025986621716, 2309.90760369585, 2354.5761762882676, 2356.257778799681, 2356.7643235676464, 2021.5047313408236, 2299.356180269527, 2348.1546643208517, 2350.764923507653, 2352.8353015288935, 2297.4141593893532, 2320.791128798408, 2329.1615018593293, 2336.100601268515, 2338.5907466193435, 2280.703508543895, 2306.2735238399932, 2312.387217387394, 2313.248194336847, 2319.4665226997718, 2300.9424764381024, 2308.6421604651305, 2310.4108452344713, 2311.9653205201766, 2313.051648823974, 8698.304135669194, 8779.78050548735, 8804.691835785718, 8821.867671984925, 8850.557472126367, 5126.410462796752, 5192.506711862367, 5356.625036247464, 5367.141257398797, 5367.35591728995, 3551.3252482028333, 3646.307201631708, 3647.3070116677745, 3650.7992060436663, 3651.908702282438, 1045.7699306152633, 1053.0890779475774, 1067.786442711453, 1078.7626722121122, 1080.3949788118678, 11342.319460832376, 11428.542858285742, 11434.371109588968, 11443.656690299222, 11488.138389620812, 4302.26861433557, 4325.480942286946, 4369.60673539383, 4394.67039971997, 4562.8631141065825, 9000.59497322622, 9014.954925225333, 9016.96304924942, 9037.68368107113, 9037.954810225907, 5066.341375621219, 5069.9746501267255, 5070.4929507049, 5073.046876952326, 5100.821471248489, 4121.361189015707, 4415.558444155558, 4507.4365704286965, 4576.6109880660515, 4745.9050818984115, 3688.6495782900583, 3697.6302369762807, 3741.5884252732176, 3761.4390028138564, 3765.378712512405, 1130.2032067392634, 1139.8347239650204, 1145.8052131137727, 1147.4320211495196, 1150.2523359816187, 770.8265640231016, 862.607513581319, 865.5628907401848, 871.1288711288711, 878.9252913502424, 5330.253764472977, 5363.168708850135, 5484.61607687466, 5527.917081243784, 5660.018993352293, 387.46142861422646, 421.496311907274, 431.0559873876264, 439.4287426345738, 441.5760869565189, 3455.4644030175364, 3633.2006958469096, 3653.634636536325, 3707.4068149096015, 3716.6283371662616, 10385.065344119066, 10875.0, 10907.618233361794, 10921.344719316867, 10944.781104377867, 10838.566457341776, 10849.132069434427, 10858.67423977282, 10870.184736144663, 10883.96602322778, 8167.959160204161, 8259.669613215525, 8261.752147435587, 8265.214804593554, 8265.669373225124, 5281.181416880389, 5417.349918009864, 5507.421720719427, 5510.283663123768, 5532.6680399176175, 9768.804623907625, 10049.648262310784, 10110.747231319276, 10124.0, 10143.79712405733, 9293.767655808388, 9952.054554817281, 10093.343932644355, 10225.642102526674, 10339.741506462398, 5767.307923049261, 6593.571417858016, 6715.764948226789, 6920.342567456084, 7032.367086962198, 8137.877931830909, 8149.918500814916, 8163.755087347389, 8197.975253093364, 8252.174782521699, 7327.230640782855, 7332.523385979895, 7359.337659610661, 7379.335859772432, 7382.114146302263, 7161.57030578167, 7235.421166306788, 7257.600831954082, 7307.013553170466, 7342.3758980487255, 6801.9319806801295, 6944.0, 6946.4095551876635, 6950.061741665013, 6968.442524597918, 4734.0, 4880.542856150143, 4912.189488734319, 4997.625178111583, 5102.974485127551, 4901.436334821398, 4981.2030075187795, 5017.54842064216, 5050.621203409685, 5133.92299115521], "value": 4350.307649875683, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [297.22720925593455, 303.97112274333944, 304.6953046953047, 309.41211697774224, 312.559291399127, 4682.4849266580695, 5225.477452254778, 5229.947700522994, 5234.7120908350025, 5274.92087618685, 4472.82108715651, 4536.4783049949265, 4959.536936603701, 5149.253358263049, 5149.639525233235, 3488.058224279443, 3684.6499582539614, 3927.6465118139363, 3927.9410808837893, 4062.923325318793, 3366.629670736217, 4013.9598604014022, 4034.253663072326, 4039.333509970851, 4081.1225586498895, 3656.3784156693428, 3732.533433320835, 3994.62051105146, 4010.8395664173545, 4024.4768180136543, 3326.301476689886, 3414.3000684859544, 3757.643023912724, 3845.423186522044, 4003.339448990913, 3116.875324986998, 3225.080851957181, 3283.5731354923946, 3487.442009278503, 3498.320806013128, 4233.0, 4442.822287108512, 5080.669756465818, 5094.809232030226, 5098.566621837148, 3664.6885014773775, 3998.300297447935, 4567.7259364437905, 4569.246074397721, 4590.357349971006, 4116.69124815637, 4748.738819364934, 5513.669179849222, 5540.750666220029, 5541.5289700375515, 3605.0, 3754.831032603512, 3755.267722794056, 3762.5861155272896, 3765.8305376258136, 5545.149866890429, 5601.495865372095, 5844.415558444164, 5900.763969441217, 5924.0, 3099.2871639523037, 3209.9839500802814, 3720.534933133358, 3797.981010094987, 3820.9617903821163, 3266.836658167082, 3378.8141652208874, 3422.982885085559, 3838.7504812187117, 3851.6340947609933, 3526.4181410067563, 3530.435130379127, 4537.821845514171, 4545.772711364419, 4587.357769912215, 5400.677708585346, 5571.331440227199, 5583.916241256385, 5595.45406839895, 5648.661080335193, 1299.1880074953153, 1320.2804471563022, 1321.7620828250815, 1324.417321301036, 1325.3307079924577, 720.4560556779597, 724.655788500458, 753.3634079203065, 783.3185128937747, 787.4527203593562, 4313.978430107893, 4425.911481770347, 5136.383633963948, 5274.630775845654, 5334.91997620036, 4889.117689689495, 5688.8862222755315, 5702.54379649627, 5714.428557144335, 5743.85640358986, 4405.920549465402, 4432.84485043022, 4946.3817022872145, 5208.531232189045, 5260.842174734764, 2332.696749422564, 2963.3184367595572, 2984.3884302476854, 3000.354923691417, 3000.4599172149224, 4901.681390709592, 5293.829529892725, 5515.7242137892945, 5837.6941108262845, 5858.627255961343, 5253.185756207794, 5481.369642491085, 5575.972120139373, 5786.971065144731, 5883.352831188566, 4964.702117873011, 5654.095344744821, 5934.525237980951, 5934.9109763354445, 5966.403359663999, 5016.2912027504735, 5049.0, 5237.685738855681, 5537.750801213874, 5716.828495145152, 5275.997560463499, 5556.944430555643, 5602.439756024365, 5631.802886898939, 5632.887667124828, 4407.823687052611, 5055.16589762685, 5668.348139963957, 5918.408159184047, 5931.673757943355, 3227.338395628937, 3511.367953768346, 3538.9206292080135, 3554.591222009502, 3560.1989552350515, 4778.709748367991, 5582.8325150245555, 5691.601587888808, 5701.515371193495, 5763.6541807491685, 4908.680935739166, 5582.720863956867, 5583.357913839798, 5614.466625670718, 5619.297587801525, 4601.539846015506, 5502.642328248811, 5543.8891222176135, 5569.248151499496, 5580.609357345109, 4452.688311818141, 5351.3043304370185, 5413.53984911287, 5437.755301011543, 5488.792465657549, 4416.939934415653, 5443.564514838883, 5472.661676377327, 5504.366997795305, 5546.223528706065, 5431.9185212221055, 5433.293671822637, 5469.042917489344, 5497.972510137423, 5517.951589198039], "value": 3952.2326964923773, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [712.7327252280395, 723.8009547374471, 742.2132539508121, 798.8601994650935, 807.5679511461366, 15200.0, 15555.53333399997, 15582.922085389557, 15588.532344029669, 15887.761683574756, 13728.313584320795, 13819.792703109437, 13828.10117342372, 13841.515546955834, 13842.238676872768, 669.9564528305644, 690.9274526174754, 695.5270416117038, 696.5089611823652, 823.9134890836451, 684.6405637040543, 688.5214775730869, 819.9057108432547, 853.7822855171922, 858.4806192253691, 898.3890954151175, 905.6875377994614, 911.9042500537447, 913.0413066280412, 915.5834095486571, 901.2204443156688, 903.3676426501443, 903.3856977255464, 904.8823652925078, 905.4160066756938, 527.4119356917048, 674.4031532094083, 674.9932500674979, 675.0582936803181, 676.2763842688325, 12209.145359824815, 13811.0, 14390.208538530376, 14414.99095063346, 14721.263936803223, 13232.574644395752, 13419.932900335534, 13608.31958402086, 14418.0, 14728.18994955277, 11521.308721476738, 11691.473883675255, 11735.64793056201, 11773.0, 12024.278543287342, 3749.1751814600743, 3774.886753397375, 3802.315583195024, 3821.216650586623, 3826.6747326477284, 114602.0, 115479.33904957162, 116260.0, 117189.41405293005, 120084.39957800243, 10955.726106847393, 11050.723731906606, 11159.218854680095, 11239.269447485887, 11350.659480215607, 22665.4333641657, 22712.318630441114, 22733.545329093657, 22784.772152278598, 22817.657735133987, 7731.613419329124, 7996.280334769898, 8125.593720313961, 8129.552874591836, 8145.79635509117, 4275.786210689453, 4441.755703436277, 4506.233940230169, 4536.977315113403, 4540.72755634663, 3567.554055743032, 3619.1675914539805, 3696.9260614787554, 3699.7780133192095, 3701.000729802938, 675.3179288918228, 675.5710124071251, 677.4648028057779, 691.1913061717802, 691.4848437913787, 537.492069993852, 617.6417677746896, 625.4496043481707, 638.0142679560091, 648.8572514046903, 9059.773505662411, 9528.0, 9537.570809313598, 9648.0, 9656.0, 534.3240800387513, 633.1009965848506, 654.2443477783168, 656.3338211715113, 687.9105716256954, 3773.660370566662, 4227.915441691211, 4608.769561521911, 4628.814847406066, 4651.67438279324, 126316.0, 138279.0, 140968.0, 146065.0, 149431.25284373725, 63299.68350158312, 78969.0, 103080.48459757803, 116587.8341216594, 131926.34036829753, 93229.0, 104493.95506044994, 117424.0, 117982.0, 121291.39354303172, 9194.58624361892, 9206.401583897294, 9944.950275248577, 9947.900520994697, 10001.299649094559, 44860.10279794451, 54275.0, 58067.128993065984, 62950.6852465753, 63184.0, 71474.64262678653, 90594.67566554181, 93685.06314936763, 95060.0, 96439.51780241054, 11758.235714678518, 13457.0, 13473.393697283449, 13530.72938541204, 13900.51348202808, 13768.862311376757, 14399.78400323975, 14573.48222051125, 14623.634409139857, 15148.318325675591, 13760.93119534396, 13977.44090236379, 14209.786853197003, 14306.928465357607, 14370.13779173253, 12490.0, 12792.872071279167, 12978.480860765463, 13117.475300987853, 13641.610409598225, 12030.458629361525, 12692.809607856074, 13286.734265314833, 13813.0, 14078.0, 10920.508577114208, 11211.60759373418, 11241.775164496828, 11661.883381166079, 11854.822177667169, 9303.953480232827, 11345.943270283597, 11537.48081336325, 11650.475728592064, 11737.35444550558], "value": 7691.984097084987, "unit": "score"}], "name": "dromaeo_css", "value": 7191.254117440375, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 115.0, 114.0, 115.0, 115.0, 114.0, 114.0, 114.0, 115.0, 114.0], "value": 114.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 117.0, 107.0, 190.0, 143.0, 142.0, 142.0, 111.0, 144.0, 111.0], "value": 135.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [183.0, 184.0, 183.0, 191.0, 184.0, 185.0, 179.0, 182.0, 183.0, 182.0], "value": 183.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 58.0, 58.0, 86.0, 58.0, 58.0, 59.0, 58.0, 82.0, 58.0], "value": 65.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 72.0, 94.0, 71.0, 69.0, 69.0, 92.0, 68.0, 69.0, 91.0], "value": 77.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 85.0, 88.0, 84.0, 86.0, 84.0, 89.0, 84.0, 87.0, 84.0], "value": 85.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 150.0, 108.0, 93.0, 92.0, 92.0, 92.0, 93.0, 93.0, 93.0], "value": 101.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 87.0, 85.0, 86.0, 86.0, 87.0, 84.0, 85.0, 87.0], "value": 85.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 54.0, 54.0, 53.0, 53.0, 56.0, 54.0, 52.0, 55.0, 56.0], "value": 54.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 66.0, 75.0, 75.0, 73.0, 70.0, 68.0, 69.0, 69.0, 72.0], "value": 70.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 86.0, 89.0, 87.0, 86.0, 86.0, 85.0, 86.0, 90.0, 86.0], "value": 86.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 144.0, 146.0, 144.0, 155.0, 149.0, 153.0, 147.0, 183.0, 146.0], "value": 151.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 174.0, 172.0, 170.0, 171.0, 172.0, 173.0, 166.0, 172.0, 169.0], "value": 171.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 67.0, 69.0, 70.0, 68.0, 70.0, 68.0, 69.0, 68.0, 68.0], "value": 68.6, "unit": "score"}], "name": "kraken", "value": 1450.9999999999998, "alertThreshold": 2.0}]} 03:33:23 INFO - Return code: 0 03:33:23 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:33:23 INFO - # TBPL SUCCESS # 03:33:23 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:33:23 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:33:23 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:33:23 INFO - 2016-10-13 03:33:23.683 screenresolution[1667:10250] starting screenresolution argv=screenresolution get 03:33:23 INFO - 2016-10-13 03:33:23.686 screenresolution[1667:10250] Display 0: 1600x1200x32@60 03:33:23 INFO - 2016-10-13 03:33:23.692 screenresolution[1668:10253] starting screenresolution argv=screenresolution list 03:33:23 INFO - Available Modes on Display 0 03:33:23 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:33:23 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:33:23 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:33:23 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:33:23 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:33:23 INFO - Intel Iris: 03:33:23 INFO - Chipset Model: Intel Iris 03:33:23 INFO - Type: GPU 03:33:23 INFO - Bus: Built-In 03:33:23 INFO - VRAM (Dynamic, Max): 1536 MB 03:33:23 INFO - Vendor: Intel (0x8086) 03:33:23 INFO - Device ID: 0x0a2e 03:33:23 INFO - Revision ID: 0x0009 03:33:23 INFO - Displays: 03:33:23 INFO - Display: 03:33:23 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:33:23 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:33:23 INFO - Display Serial Number: 1600x1200 60 03:33:23 INFO - Main Display: Yes 03:33:23 INFO - Mirror: Off 03:33:23 INFO - Online: Yes 03:33:23 INFO - Rotation: Supported 03:33:23 INFO - Return code: 0 03:33:23 INFO - Running post-action listener: _resource_record_post_action 03:33:23 INFO - [mozharness: 2016-10-13 10:33:23.928349Z] Finished run-tests step (success) 03:33:23 INFO - Running post-run listener: _resource_record_post_run 03:33:23 INFO - Total resource usage - Wall time: 1212s; CPU: 54.0%; Read bytes: 37516288; Write bytes: 712199168; Read time: 246; Write time: 2041 03:33:23 INFO - TinderboxPrint: CPU usage
53.7% 03:33:23 INFO - TinderboxPrint: I/O read bytes / time
37,516,288 / 246 03:33:23 INFO - TinderboxPrint: I/O write bytes / time
712,199,168 / 2,041 03:33:23 INFO - TinderboxPrint: CPU idle
2,247.6 (46.3%) 03:33:23 INFO - TinderboxPrint: CPU system
971.4 (20.0%) 03:33:23 INFO - TinderboxPrint: CPU user
1,630.8 (33.6%) 03:33:23 INFO - TinderboxPrint: Swap in / out
444,719,104 / 0 03:33:23 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 385004032; Write bytes: 381045760; Read time: 28166; Write time: 826 03:33:24 INFO - run-tests - Wall time: 1179s; CPU: 54.0%; Read bytes: 36557824; Write bytes: 300408832; Read time: 227; Write time: 1141 03:33:24 INFO - Running post-run listener: _upload_blobber_files 03:33:24 INFO - Blob upload gear active. 03:33:24 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:33:24 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 03:33:24 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', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:33:24 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 Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:33:24 INFO - (blobuploader) - INFO - Open directory for files ... 03:33:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 03:33:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:33:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:33:26 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 03:33:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:33:26 INFO - (blobuploader) - INFO - Done attempting. 03:33:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 03:33:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:33:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:33:27 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 03:33:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:33:27 INFO - (blobuploader) - INFO - Done attempting. 03:33:27 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:33:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:33:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:33:29 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:33:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:33:29 INFO - (blobuploader) - INFO - Done attempting. 03:33:29 INFO - (blobuploader) - INFO - Iteration through files over. 03:33:29 INFO - Return code: 0 03:33:29 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:33:29 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:33:29 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/745c4281f95406f77093674e6297b6477ff943d4c5f4dd867f5ba8fd4b0e5551980cbf82fe24cc858125d27da71f2457627f55340a273d37655c97edf9b81c56", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/44cc39c6c9794b8ea1d89f786875a82b13e490d122e7c38cfbff1628a3b79aec275b14bba8c2d545bc038e9945de2b50815953585446efc8548cd4d6c5285205", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2c7a8382fadcc70fecd8b965b658fc0080ec7ebac641e28900d1fa12c0cf57d7f58934a56871a55c067f48535b340a5eca83af5da19b80312e0e2902192438a6"} 03:33:29 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:33:29 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:33:29 INFO - Contents: 03:33:29 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/745c4281f95406f77093674e6297b6477ff943d4c5f4dd867f5ba8fd4b0e5551980cbf82fe24cc858125d27da71f2457627f55340a273d37655c97edf9b81c56", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/44cc39c6c9794b8ea1d89f786875a82b13e490d122e7c38cfbff1628a3b79aec275b14bba8c2d545bc038e9945de2b50815953585446efc8548cd4d6c5285205", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2c7a8382fadcc70fecd8b965b658fc0080ec7ebac641e28900d1fa12c0cf57d7f58934a56871a55c067f48535b340a5eca83af5da19b80312e0e2902192438a6"} 03:33:29 INFO - Running post-run listener: copy_logs_to_upload_dir 03:33:29 INFO - Copying logs to upload dir... 03:33:29 INFO - mkdir: /builds/slave/test/build/upload/logs 03:33:29 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1273.770303 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 13 secs) (at 2016-10-13 03:33:29.609758) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-13 03:33:29.613443) ========= 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.e43B01ceWb/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.h6crNHCrct/Listeners TMPDIR=/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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/Firefox/sha512/745c4281f95406f77093674e6297b6477ff943d4c5f4dd867f5ba8fd4b0e5551980cbf82fe24cc858125d27da71f2457627f55340a273d37655c97edf9b81c56", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/44cc39c6c9794b8ea1d89f786875a82b13e490d122e7c38cfbff1628a3b79aec275b14bba8c2d545bc038e9945de2b50815953585446efc8548cd4d6c5285205", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2c7a8382fadcc70fecd8b965b658fc0080ec7ebac641e28900d1fa12c0cf57d7f58934a56871a55c067f48535b340a5eca83af5da19b80312e0e2902192438a6"} build_url:https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010924 build_url: 'https://queue.taskcluster.net/v1/task/NqhDqkg6SQ6sP6TrCqJLSA/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/745c4281f95406f77093674e6297b6477ff943d4c5f4dd867f5ba8fd4b0e5551980cbf82fe24cc858125d27da71f2457627f55340a273d37655c97edf9b81c56", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/44cc39c6c9794b8ea1d89f786875a82b13e490d122e7c38cfbff1628a3b79aec275b14bba8c2d545bc038e9945de2b50815953585446efc8548cd4d6c5285205", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2c7a8382fadcc70fecd8b965b658fc0080ec7ebac641e28900d1fa12c0cf57d7f58934a56871a55c067f48535b340a5eca83af5da19b80312e0e2902192438a6"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-13 03:33:29.648523) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 03:33:29.649114) ========= 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.e43B01ceWb/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.h6crNHCrct/Listeners TMPDIR=/var/folders/fg/pfrf4nhd1hz969r_0mf1rb2400000w/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.005071 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 03:33:29.698599) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-13 03:33:29.698944) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-13 03:33:29.699300) ========= ========= Total master_lag: 0.18 =========