builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0387 starttime: 1476214067.77 results: success (0) buildid: 20161011094846 builduid: 1afea881fd6a40f19b2b70fb36f27acb revision: 687572ea20cb84f1842ad00dcc8ca1712868a361 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:47.769936) ========= master: http://buildbot-master132.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:47.770355) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:47.770644) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:47.793854) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:47.794256) ========= 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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners TMPDIR=/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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-11 12:27:47-- 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% 7.55M=0.002s 2016-10-11 12:27:48 (7.55 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.608656 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:48.423930) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:48.424202) ========= 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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners TMPDIR=/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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.022238 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:48.476147) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-11 12:27:48.476482) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 687572ea20cb84f1842ad00dcc8ca1712868a361 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 687572ea20cb84f1842ad00dcc8ca1712868a361 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.fKfgmXnDs0/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.EKNMRSkmLu/Listeners TMPDIR=/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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-11 12:27:48,556 truncating revision to first 12 chars 2016-10-11 12:27:48,556 Setting DEBUG logging. 2016-10-11 12:27:48,556 attempt 1/10 2016-10-11 12:27:48,556 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/687572ea20cb?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-11 12:27:49,534 unpacking tar archive at: fx-team-687572ea20cb/testing/mozharness/ program finished with exit code 0 elapsedTime=1.244418 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-11 12:27:49.743420) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:49.743705) ========= script_repo_revision: 687572ea20cb84f1842ad00dcc8ca1712868a361 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:49.744057) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:49.744318) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-11 12:27:49.762031) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 14 secs) (at 2016-10-11 12:27:49.762358) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', 'Fx-Team', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.fKfgmXnDs0/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.EKNMRSkmLu/Listeners TMPDIR=/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:27:49 INFO - MultiFileLogger online at 20161011 12:27:49 in /builds/slave/test 12:27:49 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 12:27:49 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:27:49 INFO - {'append_to_log': False, 12:27:49 INFO - 'base_work_dir': '/builds/slave/test', 12:27:49 INFO - 'blob_upload_branch': 'Fx-Team', 12:27:49 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:27:49 INFO - 'branch': 'Fx-Team', 12:27:49 INFO - 'buildbot_json_path': 'buildprops.json', 12:27:49 INFO - 'config_files': ('talos/mac_config.py',), 12:27:49 INFO - 'default_actions': ('clobber', 12:27:49 INFO - 'read-buildbot-config', 12:27:49 INFO - 'download-and-extract', 12:27:49 INFO - 'populate-webroot', 12:27:49 INFO - 'create-virtualenv', 12:27:49 INFO - 'install', 12:27:49 INFO - 'run-tests'), 12:27:49 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:27:49 INFO - 'download_minidump_stackwalk': True, 12:27:49 INFO - 'download_symbols': 'ondemand', 12:27:49 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:27:49 INFO - 'tooltool.py': '/tools/tooltool.py', 12:27:49 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:27:49 INFO - '/tools/misc-python/virtualenv.py')}, 12:27:49 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:27:49 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:27:49 INFO - 'installer_path': 'installer.exe', 12:27:49 INFO - 'log_level': 'info', 12:27:49 INFO - 'log_name': 'talos', 12:27:49 INFO - 'log_to_console': True, 12:27:49 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 12:27:49 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 12:27:49 INFO - 'opt_config_files': (), 12:27:49 INFO - 'pip_index': False, 12:27:49 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 12:27:49 INFO - 'cmd': ('bash', 12:27:49 INFO - '-c', 12:27:49 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 12:27:49 INFO - 'enabled': True, 12:27:49 INFO - 'halt_on_failure': False, 12:27:49 INFO - 'name': 'check_screen_resolution'},), 12:27:49 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 12:27:49 INFO - 'cmd': ('bash', 12:27:49 INFO - '-c', 12:27:49 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 12:27:49 INFO - 'enabled': True, 12:27:49 INFO - 'halt_on_failure': False, 12:27:49 INFO - 'name': 'check_screen_resolution'},), 12:27:49 INFO - 'run_cmd_checks_enabled': True, 12:27:49 INFO - 'sps_profile': False, 12:27:49 INFO - 'sps_profile_interval': 0, 12:27:49 INFO - 'suite': 'dromaeojs', 12:27:49 INFO - 'system_bits': '32', 12:27:49 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:27:49 INFO - 'title': 't-yosemite-r7-0387', 12:27:49 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:27:49 INFO - 'use_talos_json': True, 12:27:49 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:27:49 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:27:49 INFO - 'work_dir': 'build'} 12:27:49 INFO - [mozharness: 2016-10-11 19:27:49.961896Z] Running clobber step. 12:27:49 INFO - Running pre-action listener: _resource_record_pre_action 12:27:49 INFO - Running main action method: clobber 12:27:49 INFO - rmtree: /builds/slave/test/build 12:27:49 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:27:51 INFO - Running post-action listener: _resource_record_post_action 12:27:51 INFO - [mozharness: 2016-10-11 19:27:51.981823Z] Finished clobber step (success) 12:27:51 INFO - [mozharness: 2016-10-11 19:27:51.981948Z] Running read-buildbot-config step. 12:27:51 INFO - Running pre-action listener: _resource_record_pre_action 12:27:51 INFO - Running main action method: read_buildbot_config 12:27:51 INFO - Using buildbot properties: 12:27:51 INFO - { 12:27:51 INFO - "project": "", 12:27:51 INFO - "product": "firefox", 12:27:51 INFO - "script_repo_revision": "production", 12:27:51 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 12:27:51 INFO - "repository": "", 12:27:51 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 12:27:51 INFO - "buildid": "20161011094846", 12:27:51 INFO - "pgo_build": "False", 12:27:51 INFO - "basedir": "/builds/slave/test", 12:27:51 INFO - "buildnumber": 182, 12:27:51 INFO - "slavename": "t-yosemite-r7-0387", 12:27:51 INFO - "master": "http://buildbot-master132.bb.releng.scl3.mozilla.com:8201/", 12:27:51 INFO - "platform": "yosemite_r7", 12:27:51 INFO - "scheduler": "tests-fx-team-macosx64-talos", 12:27:51 INFO - "branch": "fx-team", 12:27:51 INFO - "repo_path": "integration/fx-team", 12:27:51 INFO - "revision": "687572ea20cb84f1842ad00dcc8ca1712868a361", 12:27:51 INFO - "stage_platform": "macosx64", 12:27:51 INFO - "builduid": "1afea881fd6a40f19b2b70fb36f27acb", 12:27:51 INFO - "slavebuilddir": "test" 12:27:51 INFO - } 12:27:51 INFO - Found installer url https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg. 12:27:51 INFO - Running post-action listener: _resource_record_post_action 12:27:51 INFO - [mozharness: 2016-10-11 19:27:51.985313Z] Finished read-buildbot-config step (success) 12:27:51 INFO - [mozharness: 2016-10-11 19:27:51.985456Z] Running download-and-extract step. 12:27:51 INFO - Running pre-action listener: _resource_record_pre_action 12:27:51 INFO - Running main action method: download_and_extract 12:27:51 INFO - mkdir: /builds/slave/test/build/tests 12:27: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')]} 12:27:51 INFO - trying https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json 12:27:51 INFO - Downloading https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/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 12:27:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/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 12:27:53 INFO - Downloaded 1199 bytes. 12:27:53 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 12:27:53 INFO - Using the following test package requirements: 12:27:53 INFO - {u'common': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 12:27:53 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 12:27:53 INFO - u'firefox-52.0a1.en-US.mac.cppunittest.tests.zip'], 12:27:53 INFO - u'gtest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 12:27:53 INFO - u'firefox-52.0a1.en-US.mac.gtest.tests.zip'], 12:27:53 INFO - u'jittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 12:27:53 INFO - u'jsshell-mac.zip'], 12:27:53 INFO - u'mochitest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 12:27:53 INFO - u'firefox-52.0a1.en-US.mac.mochitest.tests.zip'], 12:27:53 INFO - u'mozbase': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 12:27:53 INFO - u'reftest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 12:27:53 INFO - u'firefox-52.0a1.en-US.mac.reftest.tests.zip'], 12:27:53 INFO - u'talos': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 12:27:53 INFO - u'firefox-52.0a1.en-US.mac.talos.tests.zip'], 12:27:53 INFO - u'web-platform': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 12:27:53 INFO - u'firefox-52.0a1.en-US.mac.web-platform.tests.zip'], 12:27:53 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 12:27:53 INFO - u'firefox-52.0a1.en-US.mac.xpcshell.tests.zip']} 12:27:53 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip'] for test suite category: common 12:27:53 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 12:27:53 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 12:27:53 INFO - Fetch https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 12:27:53 INFO - Http code: 200 12:27:53 INFO - via: 1.1 bb8a7ff26b131d51953dc2d3e19a2751.cloudfront.net (CloudFront) 12:27:53 INFO - x-amz-cf-id: rcNNXcc5RkrR0hwRzWBbUYZFQcS077BmUl3bSirmEXmb3O-WVdN2ZQ== 12:27:53 INFO - x-amz-version-id: ieqjW6NXvrtLvHQfDt9HiL1yU08jrZTa 12:27:54 INFO - Expected file size: 16508602 12:27:54 INFO - Obtained file size: 16508602 12:28:00 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 12:28:00 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 12:28:00 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 12:28:00 INFO - Fetch https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 12:28:01 INFO - Http code: 200 12:28:01 INFO - via: 1.1 73fa5a1ee49cf827e596b502b5927eab.cloudfront.net (CloudFront) 12:28:01 INFO - x-amz-cf-id: Ah8FcGtoxvZEGThbPbICg9VA0NtpzyXpSSWeJH-Ss0vZMD00EDXCHw== 12:28:01 INFO - x-amz-version-id: ieqjW6NXvrtLvHQfDt9HiL1yU08jrZTa 12:28:01 INFO - Expected file size: 16508602 12:28:01 INFO - Obtained file size: 16508602 12:28:08 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip 12:28:08 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip'}, attempt #1 12:28:08 INFO - Fetch https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip into memory 12:28:08 INFO - Http code: 200 12:28:08 INFO - via: 1.1 423912f2b1c5569e2fa5017167c61fa0.cloudfront.net (CloudFront) 12:28:08 INFO - x-amz-cf-id: _bhoiRbNqtwv8K3daXJTj9SwB1MH8cNbYJlUXZkOF9S0PPudqFgxHQ== 12:28:08 INFO - x-amz-version-id: 1nDkkI2ka1oeLgmNnk9JsS.QtK.ZGXvJ 12:28:08 INFO - Expected file size: 14409006 12:28:08 INFO - Obtained file size: 14409006 12:28:09 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')]} 12:28:09 INFO - trying https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 12:28:09 INFO - Downloading https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg 12:28:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/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 12:28:12 INFO - Downloaded 111681798 bytes. 12:28:12 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 12:28:12 INFO - mkdir: /builds/slave/test/properties 12:28:12 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:28:12 INFO - Writing to file /builds/slave/test/properties/build_url 12:28:12 INFO - Contents: 12:28:12 INFO - build_url:https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 12:28:12 INFO - Running post-action listener: _resource_record_post_action 12:28:12 INFO - Running post-action listener: set_extra_try_arguments 12:28:12 INFO - [mozharness: 2016-10-11 19:28:12.700774Z] Finished download-and-extract step (success) 12:28:12 INFO - [mozharness: 2016-10-11 19:28:12.700893Z] Running populate-webroot step. 12:28:12 INFO - Running pre-action listener: _resource_record_pre_action 12:28:12 INFO - Running main action method: populate_webroot 12:28:12 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:28:12 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:28:12 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:28:12 INFO - '--tppagecycles', 12:28:12 INFO - '7'], 12:28:12 INFO - 'tests': ['tsvgm']}}, 12:28:12 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:28:12 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:28:12 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:28:12 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:28:12 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:12 INFO - 'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:28:12 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:28:12 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:12 INFO - 'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['damp', 'tps']}, 12:28:12 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:12 INFO - 'tests': ['damp', 'tps']}, 12:28:12 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['dromaeo_dom']}, 12:28:12 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:28:12 INFO - 'g4': {'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['basic_compositor_video']}, 12:28:12 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 12:28:12 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['a11yr', 12:28:12 INFO - 'ts_paint', 12:28:12 INFO - 'tpaint', 12:28:12 INFO - 'sessionrestore', 12:28:12 INFO - 'sessionrestore_no_auto_restore', 12:28:12 INFO - 'tabpaint']}, 12:28:12 INFO - 'other-e10s': {'tests': ['a11yr', 12:28:12 INFO - 'ts_paint', 12:28:12 INFO - 'tpaint', 12:28:12 INFO - 'sessionrestore', 12:28:12 INFO - 'sessionrestore_no_auto_restore', 12:28:12 INFO - 'tabpaint']}, 12:28:12 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:28:12 INFO - 'ts_paint', 12:28:12 INFO - 'tpaint', 12:28:12 INFO - 'sessionrestore', 12:28:12 INFO - 'sessionrestore_no_auto_restore', 12:28:12 INFO - 'tabpaint']}, 12:28:12 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:28:12 INFO - 'ts_paint', 12:28:12 INFO - 'tpaint', 12:28:12 INFO - 'sessionrestore', 12:28:12 INFO - 'sessionrestore_no_auto_restore', 12:28:12 INFO - 'tabpaint']}, 12:28:12 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['a11yr', 12:28:12 INFO - 'ts_paint', 12:28:12 INFO - 'tpaint', 12:28:12 INFO - 'sessionrestore', 12:28:12 INFO - 'sessionrestore_no_auto_restore', 12:28:12 INFO - 'tabpaint']}, 12:28:12 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['a11yr', 12:28:12 INFO - 'ts_paint', 12:28:12 INFO - 'tpaint', 12:28:12 INFO - 'sessionrestore', 12:28:12 INFO - 'sessionrestore_no_auto_restore', 12:28:12 INFO - 'tabpaint']}, 12:28:12 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['tsvgx', 12:28:12 INFO - 'tsvgr_opacity', 12:28:12 INFO - 'tart', 12:28:12 INFO - 'tscrollx', 12:28:12 INFO - 'cart']}, 12:28:12 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:28:12 INFO - 'tsvgr_opacity', 12:28:12 INFO - 'tart', 12:28:12 INFO - 'tscrollx', 12:28:12 INFO - 'cart']}, 12:28:12 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:12 INFO - 'talos_options': ['--disable-e10s'], 12:28:12 INFO - 'tests': ['tp5o']}, 12:28:12 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:12 INFO - 'tests': ['tp5o']}, 12:28:12 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:12 INFO - 'talos_options': ['--disable-e10s', 12:28:12 INFO - '--xperf_path', 12:28:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:28:12 INFO - 'tests': ['tp5n']}, 12:28:12 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:12 INFO - 'talos_options': ['--xperf_path', 12:28:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:28:12 INFO - 'tests': ['tp5n']}}, 12:28:12 INFO - 'talos.zip': {'path': '', 12:28:12 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:28:12 INFO - Running post-action listener: _resource_record_post_action 12:28:12 INFO - [mozharness: 2016-10-11 19:28:12.719469Z] Finished populate-webroot step (success) 12:28:12 INFO - [mozharness: 2016-10-11 19:28:12.719600Z] Running create-virtualenv step. 12:28:12 INFO - Running pre-action listener: _resource_record_pre_action 12:28:12 INFO - Running main action method: create_virtualenv 12:28:12 INFO - Creating virtualenv /builds/slave/test/build/venv 12:28:12 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 12:28:12 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:28:12 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:28:12 INFO - Using real prefix '/tools/python27' 12:28:12 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:28:13 INFO - Installing distribute.............................................................................................................................................................................................done. 12:28:16 INFO - Installing pip.................done. 12:28:16 INFO - Return code: 0 12:28:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 12:28:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 12:28:16 INFO - Reading from file tmpfile_stdout 12:28:16 INFO - Output received: 12:28:16 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) 12:28:16 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:28:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 12:28:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 12:28:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:16 INFO - 'HOME': '/Users/cltbld', 12:28:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:16 INFO - 'LOGNAME': 'cltbld', 12:28:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:16 INFO - 'MOZ_NO_REMOTE': '1', 12:28:16 INFO - 'NO_EM_RESTART': '1', 12:28:16 INFO - 'PAGER': '/bin/cat', 12:28:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:16 INFO - 'PWD': '/builds/slave/test', 12:28:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:16 INFO - 'SHELL': '/bin/bash', 12:28:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:16 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:16 INFO - 'USER': 'cltbld', 12:28:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:16 INFO - 'XPC_FLAGS': '0x0', 12:28:16 INFO - 'XPC_SERVICE_NAME': '0', 12:28:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:16 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 12:28:16 INFO - Cleaning up... 12:28:16 INFO - Return code: 0 12:28:16 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:28:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 12:28:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 12:28:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:16 INFO - 'HOME': '/Users/cltbld', 12:28:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:16 INFO - 'LOGNAME': 'cltbld', 12:28:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:16 INFO - 'MOZ_NO_REMOTE': '1', 12:28:16 INFO - 'NO_EM_RESTART': '1', 12:28:16 INFO - 'PAGER': '/bin/cat', 12:28:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:16 INFO - 'PWD': '/builds/slave/test', 12:28:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:16 INFO - 'SHELL': '/bin/bash', 12:28:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:16 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:16 INFO - 'USER': 'cltbld', 12:28:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:16 INFO - 'XPC_FLAGS': '0x0', 12:28:16 INFO - 'XPC_SERVICE_NAME': '0', 12:28:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:17 INFO - Downloading/unpacking psutil>=3.1.1 12:28:17 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 12:28:17 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 12:28:17 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 12:28:17 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 12:28:17 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 12:28:17 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 12:28:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:28:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:28:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:28:21 INFO - Installing collected packages: psutil 12:28:21 INFO - Running setup.py install for psutil 12:28:21 INFO - building 'psutil._psutil_osx' extension 12:28:21 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 12:28:21 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 12:28:21 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 12:28:21 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 12:28:21 INFO - building 'psutil._psutil_posix' extension 12:28:21 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 12:28:21 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 12:28:21 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 12:28:21 INFO - ^ 12:28:21 INFO - 1 warning generated. 12:28:21 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 12:28:21 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:28:21 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:28:21 INFO - Successfully installed psutil 12:28:21 INFO - Cleaning up... 12:28:22 INFO - Return code: 0 12:28:22 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:28:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:22 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 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:22 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 12:28:22 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 12:28:22 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:22 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:22 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:22 INFO - 'HOME': '/Users/cltbld', 12:28:22 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:22 INFO - 'LOGNAME': 'cltbld', 12:28:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:22 INFO - 'MOZ_NO_REMOTE': '1', 12:28:22 INFO - 'NO_EM_RESTART': '1', 12:28:22 INFO - 'PAGER': '/bin/cat', 12:28:22 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:22 INFO - 'PWD': '/builds/slave/test', 12:28:22 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:22 INFO - 'SHELL': '/bin/bash', 12:28:22 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:22 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:22 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:22 INFO - 'USER': 'cltbld', 12:28:22 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:22 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:22 INFO - 'XPC_FLAGS': '0x0', 12:28:22 INFO - 'XPC_SERVICE_NAME': '0', 12:28:22 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:22 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:28:22 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 12:28:22 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 12:28:22 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 12:28:22 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 12:28:22 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 12:28:22 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 12:28:24 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:28:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:28:24 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:28:24 INFO - Installing collected packages: mozsystemmonitor 12:28:24 INFO - Running setup.py install for mozsystemmonitor 12:28:24 INFO - Successfully installed mozsystemmonitor 12:28:24 INFO - Cleaning up... 12:28:25 INFO - Return code: 0 12:28:25 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:28:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 12:28:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 12:28:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:25 INFO - 'HOME': '/Users/cltbld', 12:28:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:25 INFO - 'LOGNAME': 'cltbld', 12:28:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:25 INFO - 'MOZ_NO_REMOTE': '1', 12:28:25 INFO - 'NO_EM_RESTART': '1', 12:28:25 INFO - 'PAGER': '/bin/cat', 12:28:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:25 INFO - 'PWD': '/builds/slave/test', 12:28:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:25 INFO - 'SHELL': '/bin/bash', 12:28:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:25 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:25 INFO - 'USER': 'cltbld', 12:28:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:25 INFO - 'XPC_FLAGS': '0x0', 12:28:25 INFO - 'XPC_SERVICE_NAME': '0', 12:28:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:25 INFO - Downloading/unpacking jsonschema==2.5.1 12:28:25 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 12:28:25 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 12:28:25 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 12:28:25 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 12:28:25 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 12:28:25 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 12:28:27 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:28:27 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:28:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:28 INFO - Downloading functools32-3.2.3-2.tar.gz 12:28:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:28:28 INFO - warning: no files found matching '*.txt' 12:28:28 INFO - no previously-included directories found matching 'build' 12:28:28 INFO - no previously-included directories found matching 'dist' 12:28:28 INFO - no previously-included directories found matching '.git*' 12:28:28 INFO - Installing collected packages: jsonschema, functools32 12:28:28 INFO - Running setup.py install for functools32 12:28:28 INFO - warning: no files found matching '*.txt' 12:28:28 INFO - no previously-included directories found matching 'build' 12:28:28 INFO - no previously-included directories found matching 'dist' 12:28:28 INFO - no previously-included directories found matching '.git*' 12:28:28 INFO - Successfully installed jsonschema functools32 12:28:28 INFO - Cleaning up... 12:28:28 INFO - Return code: 0 12:28:28 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 12:28:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 12:28:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 12:28:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:28 INFO - 'HOME': '/Users/cltbld', 12:28:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:28 INFO - 'LOGNAME': 'cltbld', 12:28:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:28 INFO - 'MOZ_NO_REMOTE': '1', 12:28:28 INFO - 'NO_EM_RESTART': '1', 12:28:28 INFO - 'PAGER': '/bin/cat', 12:28:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:28 INFO - 'PWD': '/builds/slave/test', 12:28:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:28 INFO - 'SHELL': '/bin/bash', 12:28:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:28 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:28 INFO - 'USER': 'cltbld', 12:28:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:28 INFO - 'XPC_FLAGS': '0x0', 12:28:28 INFO - 'XPC_SERVICE_NAME': '0', 12:28:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:28 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 12:28:28 INFO - Cleaning up... 12:28:28 INFO - Return code: 0 12:28:28 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:28:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 12:28:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 12:28:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:28 INFO - 'HOME': '/Users/cltbld', 12:28:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:28 INFO - 'LOGNAME': 'cltbld', 12:28:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:28 INFO - 'MOZ_NO_REMOTE': '1', 12:28:28 INFO - 'NO_EM_RESTART': '1', 12:28:28 INFO - 'PAGER': '/bin/cat', 12:28:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:28 INFO - 'PWD': '/builds/slave/test', 12:28:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:28 INFO - 'SHELL': '/bin/bash', 12:28:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:28 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:28 INFO - 'USER': 'cltbld', 12:28:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:28 INFO - 'XPC_FLAGS': '0x0', 12:28:28 INFO - 'XPC_SERVICE_NAME': '0', 12:28:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:29 INFO - Downloading/unpacking blobuploader==1.2.4 12:28:29 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 12:28:29 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 12:28:29 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 12:28:29 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 12:28:29 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 12:28:29 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 12:28:31 INFO - Downloading blobuploader-1.2.4.tar.gz 12:28:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:28:31 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:28:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:28:32 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:28:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:32 INFO - Downloading docopt-0.6.1.tar.gz 12:28:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:28:33 INFO - Installing collected packages: blobuploader, requests, docopt 12:28:33 INFO - Running setup.py install for blobuploader 12:28:33 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:28:33 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:28:33 INFO - Running setup.py install for requests 12:28:33 INFO - Running setup.py install for docopt 12:28:33 INFO - Successfully installed blobuploader requests docopt 12:28:33 INFO - Cleaning up... 12:28:33 INFO - Return code: 0 12:28:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:33 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 12:28:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:28:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:33 INFO - 'HOME': '/Users/cltbld', 12:28:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:33 INFO - 'LOGNAME': 'cltbld', 12:28:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:33 INFO - 'MOZ_NO_REMOTE': '1', 12:28:33 INFO - 'NO_EM_RESTART': '1', 12:28:33 INFO - 'PAGER': '/bin/cat', 12:28:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:33 INFO - 'PWD': '/builds/slave/test', 12:28:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:33 INFO - 'SHELL': '/bin/bash', 12:28:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:33 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:33 INFO - 'USER': 'cltbld', 12:28:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:33 INFO - 'XPC_FLAGS': '0x0', 12:28:33 INFO - 'XPC_SERVICE_NAME': '0', 12:28:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:28:34 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-wzarns-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:28:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:28:34 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-HPR02n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:28:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:28:34 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-SLG5O2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:28:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:28:34 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-77HT6R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:28:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:28:34 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-JWsd3m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:28:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:28:34 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-igyOo7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:28:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:28:34 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-9WnmZn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:28:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:28:34 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-1SUfm2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-Oyf4jy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-4llDsL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-KuRbGN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-kEOHnT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-OpJxtQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-O3jgLa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-4p6pCO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-KgTm6i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:28:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:28:35 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-49gOwU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:28:36 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:28:36 INFO - Running setup.py install for manifestparser 12:28:36 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:28:36 INFO - Running setup.py install for mozcrash 12:28:36 INFO - Running setup.py install for mozdebug 12:28:36 INFO - Running setup.py install for mozdevice 12:28:36 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:28:36 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:28:36 INFO - Running setup.py install for mozfile 12:28:36 INFO - Running setup.py install for mozhttpd 12:28:36 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:28:36 INFO - Running setup.py install for mozinfo 12:28:37 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Running setup.py install for mozInstall 12:28:37 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Running setup.py install for mozleak 12:28:37 INFO - Running setup.py install for mozlog 12:28:37 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Running setup.py install for moznetwork 12:28:37 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Running setup.py install for mozprocess 12:28:37 INFO - Running setup.py install for mozprofile 12:28:37 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:28:37 INFO - Running setup.py install for mozrunner 12:28:38 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:28:38 INFO - Running setup.py install for mozscreenshot 12:28:38 INFO - Running setup.py install for moztest 12:28:38 INFO - Running setup.py install for mozversion 12:28:38 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:28:38 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:28:38 INFO - Cleaning up... 12:28:38 INFO - Return code: 0 12:28:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 12:28:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:28:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:38 INFO - 'HOME': '/Users/cltbld', 12:28:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:38 INFO - 'LOGNAME': 'cltbld', 12:28:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:38 INFO - 'MOZ_NO_REMOTE': '1', 12:28:38 INFO - 'NO_EM_RESTART': '1', 12:28:38 INFO - 'PAGER': '/bin/cat', 12:28:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:38 INFO - 'PWD': '/builds/slave/test', 12:28:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:38 INFO - 'SHELL': '/bin/bash', 12:28:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:38 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:38 INFO - 'USER': 'cltbld', 12:28:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:38 INFO - 'XPC_FLAGS': '0x0', 12:28:38 INFO - 'XPC_SERVICE_NAME': '0', 12:28:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:28:38 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-NKOx5v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:28:38 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 12:28:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:28:38 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-qOSpmO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:28:39 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)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-COKqX3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:28:39 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)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-YPj244-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:28:39 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)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-ms_o4E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:28:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-gINWM4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:28:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-F9EM6Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:28:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-v444uO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:28:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-FcR7ls-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:28:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-W5DpWa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:28:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:28:39 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-2ODZDW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:28:40 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)) 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:28:40 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-O3ND4q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:28:40 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)) 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:28:40 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-7RVKnc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:28:40 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)) 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:28:40 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-_7M1IU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:28:40 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)) 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:40 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-aADEZO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:28:40 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-vBEqdl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:28:40 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)) 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:28:40 INFO - Running setup.py (path:/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/pip-8DMlpM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:28:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 12:28:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:28:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:28:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 12:28:40 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:28:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:28:40 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:28:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:43 INFO - Downloading blessings-1.6.tar.gz 12:28:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:28:43 INFO - Installing collected packages: blessings 12:28:43 INFO - Running setup.py install for blessings 12:28:43 INFO - Successfully installed blessings 12:28:43 INFO - Cleaning up... 12:28:43 INFO - Return code: 0 12:28:43 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:28:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:28:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:28:43 INFO - Reading from file tmpfile_stdout 12:28:43 INFO - Current package versions: 12:28:43 INFO - blessings == 1.6 12:28:43 INFO - blobuploader == 1.2.4 12:28:43 INFO - docopt == 0.6.1 12:28:43 INFO - functools32 == 3.2.3-2 12:28:43 INFO - jsonschema == 2.5.1 12:28:43 INFO - manifestparser == 1.1 12:28:43 INFO - mozInstall == 1.12 12:28:43 INFO - mozcrash == 0.17 12:28:43 INFO - mozdebug == 0.1 12:28:43 INFO - mozdevice == 0.48 12:28:43 INFO - mozfile == 1.2 12:28:43 INFO - mozhttpd == 0.7 12:28:43 INFO - mozinfo == 0.9 12:28:43 INFO - mozleak == 0.1 12:28:43 INFO - mozlog == 3.4 12:28:43 INFO - moznetwork == 0.27 12:28:43 INFO - mozprocess == 0.23 12:28:43 INFO - mozprofile == 0.28 12:28:43 INFO - mozrunner == 6.12 12:28:43 INFO - mozscreenshot == 0.1 12:28:43 INFO - mozsystemmonitor == 0.3 12:28:43 INFO - moztest == 0.7 12:28:43 INFO - mozversion == 1.4 12:28:43 INFO - psutil == 3.1.1 12:28:43 INFO - requests == 1.2.3 12:28:43 INFO - wsgiref == 0.1.2 12:28:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28: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')]} 12:28:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28: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')]} 12:28:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 12:28:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:28:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:43 INFO - 'HOME': '/Users/cltbld', 12:28:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:43 INFO - 'LOGNAME': 'cltbld', 12:28:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:43 INFO - 'MOZ_NO_REMOTE': '1', 12:28:43 INFO - 'NO_EM_RESTART': '1', 12:28:43 INFO - 'PAGER': '/bin/cat', 12:28:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:43 INFO - 'PWD': '/builds/slave/test', 12:28:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:43 INFO - 'SHELL': '/bin/bash', 12:28:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:43 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:43 INFO - 'USER': 'cltbld', 12:28:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:43 INFO - 'XPC_FLAGS': '0x0', 12:28:43 INFO - 'XPC_SERVICE_NAME': '0', 12:28:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 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)) 12:28:44 INFO - Cleaning up... 12:28:44 INFO - Return code: 0 12:28:44 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:28:44 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')]} 12:28:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:44 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')]} 12:28:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:44 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 0x102a37490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ad570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa610dc4010>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, '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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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 12:28:44 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 12:28:44 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 12:28:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:28:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:28:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:28:44 INFO - 'HOME': '/Users/cltbld', 12:28:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:28:44 INFO - 'LOGNAME': 'cltbld', 12:28:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:44 INFO - 'MOZ_NO_REMOTE': '1', 12:28:44 INFO - 'NO_EM_RESTART': '1', 12:28:44 INFO - 'PAGER': '/bin/cat', 12:28:44 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:28:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:44 INFO - 'PWD': '/builds/slave/test', 12:28:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:28:44 INFO - 'SHELL': '/bin/bash', 12:28:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:28:44 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:28:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:28:44 INFO - 'USER': 'cltbld', 12:28:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:28:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:28:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:44 INFO - 'XPC_FLAGS': '0x0', 12:28:44 INFO - 'XPC_SERVICE_NAME': '0', 12:28:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:28:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:44 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:28:44 INFO - Cleaning up... 12:28:44 INFO - Return code: 0 12:28:44 INFO - Running post-action listener: _resource_record_post_action 12:28:44 INFO - Running post-action listener: _start_resource_monitoring 12:28:44 INFO - Starting resource monitoring. 12:28:44 INFO - [mozharness: 2016-10-11 19:28:44.402665Z] Finished create-virtualenv step (success) 12:28:44 INFO - [mozharness: 2016-10-11 19:28:44.403663Z] Running install step. 12:28:44 INFO - Running pre-action listener: _resource_record_pre_action 12:28:44 INFO - Running main action method: install 12:28:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:28:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:28:44 INFO - Reading from file tmpfile_stdout 12:28:44 INFO - Detecting whether we're running mozinstall >=1.0... 12:28:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:28:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:28:44 INFO - Reading from file tmpfile_stdout 12:28:44 INFO - Output received: 12:28:44 INFO - Usage: mozinstall [options] installer 12:28:44 INFO - Options: 12:28:44 INFO - -h, --help show this help message and exit 12:28:44 INFO - -d DEST, --destination=DEST 12:28:44 INFO - Directory to install application into. [default: 12:28:44 INFO - "/builds/slave/test"] 12:28:44 INFO - --app=APP Application being installed. [default: firefox] 12:28:44 INFO - mkdir: /builds/slave/test/build/application 12:28:44 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'] 12:28:44 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 12:29:19 INFO - Reading from file tmpfile_stdout 12:29:19 INFO - Output received: 12:29:19 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 12:29:19 INFO - Running post-action listener: _resource_record_post_action 12:29:19 INFO - [mozharness: 2016-10-11 19:29:19.290780Z] Finished install step (success) 12:29:19 INFO - [mozharness: 2016-10-11 19:29:19.290947Z] Running run-tests step. 12:29:19 INFO - Running pre-action listener: _resource_record_pre_action 12:29:19 INFO - Running main action method: run_tests 12:29:19 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 12:29:19 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 12:29:19 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 12:29:19 INFO - 2016-10-11 12:29:19.306 screenresolution[1937:20118] starting screenresolution argv=screenresolution get 12:29:19 INFO - 2016-10-11 12:29:19.309 screenresolution[1937:20118] Display 0: 1600x1200x32@60 12:29:19 INFO - 2016-10-11 12:29:19.315 screenresolution[1938:20120] starting screenresolution argv=screenresolution list 12:29:19 INFO - Available Modes on Display 0 12:29:19 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 12:29:19 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 12:29:19 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 12:29:19 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 12:29:19 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 12:29:19 INFO - Intel Iris: 12:29:19 INFO - Chipset Model: Intel Iris 12:29:19 INFO - Type: GPU 12:29:19 INFO - Bus: Built-In 12:29:19 INFO - VRAM (Dynamic, Max): 1536 MB 12:29:19 INFO - Vendor: Intel (0x8086) 12:29:19 INFO - Device ID: 0x0a2e 12:29:19 INFO - Revision ID: 0x0009 12:29:19 INFO - Displays: 12:29:19 INFO - Display: 12:29:19 INFO - Resolution: 1600 x 1200 @ 60 Hz 12:29:19 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 12:29:19 INFO - Display Serial Number: 1600x1200 60 12:29:19 INFO - Main Display: Yes 12:29:19 INFO - Mirror: Off 12:29:19 INFO - Online: Yes 12:29:19 INFO - Rotation: Supported 12:29:19 INFO - Return code: 0 12:29:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:29:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:29:19 INFO - Python 2.7.3 12:29:19 INFO - Return code: 0 12:29:19 INFO - grabbing minidump binary from tooltool 12:29:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:29:19 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 0x10284bd30>, '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 0x102671db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102843b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:29:19 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 12:29:19 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 12:29:19 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 12:29:19 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:29:19 INFO - Return code: 0 12:29:19 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 12:29:19 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:29:19 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:29:19 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 12:29:19 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:29:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0387', '--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 12:29:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0387 --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 12:29:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.fKfgmXnDs0/Render', 12:29:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 12:29:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 12:29:19 INFO - 'HOME': '/Users/cltbld', 12:29:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 12:29:19 INFO - 'LOGNAME': 'cltbld', 12:29:19 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:29:19 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 12:29:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:29:19 INFO - 'MOZ_NO_REMOTE': '1', 12:29:19 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:29:19 INFO - 'NO_EM_RESTART': '1', 12:29:19 INFO - 'PAGER': '/bin/cat', 12:29:19 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 12:29:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:29:19 INFO - 'PWD': '/builds/slave/test', 12:29:19 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:29:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 12:29:19 INFO - 'SHELL': '/bin/bash', 12:29:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.EKNMRSkmLu/Listeners', 12:29:19 INFO - 'TMPDIR': '/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/', 12:29:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 12:29:19 INFO - 'USER': 'cltbld', 12:29:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 12:29:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 12:29:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:29:19 INFO - 'XPC_FLAGS': '0x0', 12:29:19 INFO - 'XPC_SERVICE_NAME': '0', 12:29:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 12:29:19 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0387', '--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 12:29:19 INFO - mozversion application_buildid: 20161011094846 12:29:19 INFO - mozversion application_changeset: 687572ea20cb84f1842ad00dcc8ca1712868a361 12:29:19 INFO - mozversion application_display_name: Nightly 12:29:19 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:29:19 INFO - mozversion application_name: Firefox 12:29:19 INFO - mozversion application_remotingname: firefox 12:29:19 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 12:29:19 INFO - mozversion application_vendor: Mozilla 12:29:19 INFO - mozversion application_version: 52.0a1 12:29:19 INFO - mozversion platform_buildid: 20161011094846 12:29:19 INFO - mozversion platform_changeset: 687572ea20cb84f1842ad00dcc8ca1712868a361 12:29:19 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 12:29:19 INFO - mozversion platform_version: 52.0a1 12:29:19 INFO - using testdate: 1476214159 12:29:19 INFO - actual date: 1476214159 12:29:19 INFO - starting webserver on 'localhost:57237' 12:29:19 INFO - SUITE-START | Running 2 tests 12:29:19 INFO - TEST-START | dromaeo_css 12:29:19 INFO - operating with platform_type : mac_ 12:29:19 INFO - Initialising browser for dromaeo_css test... 12:29:19 INFO - TEST-INFO | started process 1948 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/tmpgK20c_/profile http://localhost:57237/getInfo.html) 12:29:22 INFO - PROCESS | 1948 | __metrics Screen width/height:1600/1200 12:29:22 INFO - PROCESS | 1948 | colorDepth:24 12:29:22 INFO - PROCESS | 1948 | Browser inner width/height: 1024/689 12:29:22 INFO - PROCESS | 1948 | __metrics 12:29:22 INFO - PROCESS | 1948 | 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" 12:29:22 INFO - PROCESS | 1948 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:29:23 INFO - TEST-INFO | 1948: exit 0 12:29:23 INFO - Browser initialized. 12:29:23 INFO - Running cycle 1/1 for dromaeo_css test... 12:29:23 INFO - TEST-INFO | started process 1950 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/tmpgK20c_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:29:35 INFO - PROCESS | 1950 | RSS: Main: 235044864 12:29:35 INFO - PROCESS | 1950 | 12:30:26 INFO - PROCESS | 1950 | 1476214226581 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] 12:32:39 INFO - PROCESS | 1950 | Cycle 1(1): loaded http://localhost:57237/tests/dromaeo/cssquery-dojo.html (next: http://localhost:57237/tests/dromaeo/cssquery-ext.html) 12:32:41 INFO - PROCESS | 1950 | RSS: Main: 422129664 12:32:41 INFO - PROCESS | 1950 | 12:35:43 INFO - PROCESS | 1950 | Cycle 1(1): loaded http://localhost:57237/tests/dromaeo/cssquery-ext.html (next: http://localhost:57237/tests/dromaeo/cssquery-jquery.html) 12:35:44 INFO - PROCESS | 1950 | RSS: Main: 398102528 12:35:44 INFO - PROCESS | 1950 | 12:38:46 INFO - PROCESS | 1950 | Cycle 1(1): loaded http://localhost:57237/tests/dromaeo/cssquery-jquery.html (next: http://localhost:57237/tests/dromaeo/cssquery-mootools.html) 12:38:47 INFO - PROCESS | 1950 | RSS: Main: 334090240 12:38:47 INFO - PROCESS | 1950 | 12:41:49 INFO - PROCESS | 1950 | Cycle 1(1): loaded http://localhost:57237/tests/dromaeo/cssquery-mootools.html (next: http://localhost:57237/tests/dromaeo/cssquery-prototype.html) 12:41:50 INFO - PROCESS | 1950 | RSS: Main: 348909568 12:41:50 INFO - PROCESS | 1950 | 12:44:53 INFO - PROCESS | 1950 | Cycle 1(1): loaded http://localhost:57237/tests/dromaeo/cssquery-prototype.html (next: http://localhost:57237/tests/dromaeo/cssquery-yui.html) 12:44:54 INFO - PROCESS | 1950 | RSS: Main: 331608064 12:44:54 INFO - PROCESS | 1950 | 12:47:57 INFO - PROCESS | 1950 | Cycle 1(1): loaded http://localhost:57237/tests/dromaeo/cssquery-yui.html (next: http://localhost:57237/tests/dromaeo/cssquery-dojo.html) 12:47:58 INFO - PROCESS | 1950 | RSS: Main: 513224704 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - PROCESS | 1950 | __start_tp_report 12:47:58 INFO - PROCESS | 1950 | _x_x_mozilla_page_load 12:47:58 INFO - PROCESS | 1950 | _x_x_mozilla_page_load_details 12:47:58 INFO - PROCESS | 1950 | |i|pagename|runs| 12:47:58 INFO - PROCESS | 1950 | |0;dojo.html;2778.4443111377727;2942.4703553360396;3238.449463591189;3256.853441595128;3297.752668549859;5468.207109969052;5554.416786237448;5600;5615.354234263061;5631.4087020862835;5580.190872323511;5582.91625625616;5599.468050535203;5600.943990560093;5603.3836278009385;5072.9492705072935;5106.336176297076;5118.129917913963;5175.378954525462;5214.530692237698;5169.40551836538;5235.0053489837;5243.580513558906;5248.68507889526;5253.238280449333;4499.212637788391;5129.2306154077;5158.045761534128;5167.044096842096;5177.223416487519;5236.319278493809;5237.057329680656;5264.131418315973;5268.894622107575;5283.709395983219;5036.118679231156;5052.8484145475695;5109.642325037249;5151.278820965068;5171.844844654666;5470.835874923759;5555.138953462219;5565.193047008162;5597.524210442118;5604.047311956977;6090.086487026937;6097.054956481708;6105.786297479567;6110.419510146573;6150.200473938359;5441.401445840955;6064;6095.697388267035;6136.539759518054;6213.720382582795;5631.71841407928;5661.348944871352;5672.5745569081655;5700.087985922232;5743.368229494752;6274.090256912722;6302.905456418157;6309.432151106423;6313.494920406357;6327.367263273728;5644.5484361251;5839.240898683229;5942.910856337158;6046.032634778414;6072;6118.174046503754;6123.83172914054;6147.985582378947;6199.969000155061;6234.2830574483605;6161.229846269216;6161.260648722182;6164.876702466016;6164.969175154185;6175.722092505848;6166.229221347332;6177.135201071854;6187.969060154761;6196.969015154986;6198.783042593487;4749.501302363271;4811.759412029384;4827.903441931142;4878.487758785276;4882.170031094652;4379.759113248738;4397.054633253866;4400.185965596375;4423.225935461282;4430.291153415438;5524.254225679482;5577.247071645357;5583.944160558342;5590.944090559043;5593.524550413261;6138.602983405075;6141.608749743955;6143.539234557426;6149.600275982047;6164.198654175018;5604.635698679573;5617.21359009739;5651.660900345993;5679.403662615448;5683.715814209273;5289.735513224324;5297.682139071591;5303.655262407931;5315.255864179018;5326.2543243945875;6132.5400594956445;6300.7479700811455;6306.684665766693;6312.810615681628;6328.71520781566;5916.881662366814;5989.9700501498955;6098.522998456991;6177.938220617916;6200.3489633589625;6276.592021518587;6286.18279623646;6299.149614801943;6304.842378940563;6310.400511951358;6111.84720381994;6122.204113465221;6131.754729810757;6132.08018797184;6151.384861513813;5904.143899134688;5987.43119403656;6061.848453788691;6124.533510047433;6166.229221347332;6048.0625503047095;6072.605280656743;6107.267127944675;6125.081237814364;6144.969275153596;6026.367231440636;6039.094135879654;6055.1220073090035;6065.423784740443;6074.635521868702;5683.204351390891;5829.8251052468495;5861.7655293787775;5881.823545293648;5915.171875937458;5881.941180588139;5955.285365756137;5968.522518198621;5987.072003839412;6019.367966363644;5847.649141051551;5865.120231965239;5884.176215329771;5896.9115463268945;5916.083007133901 12:47:58 INFO - PROCESS | 1950 | |1;ext.html;451.93569144664315;499.06425452276983;504.41235960106457;511.4067681489473;515.0445922813184;29278.85360573197;38281.425778613346;39216.99999999996;39274.341503406846;41474.58525414745;40006.39990400146;40391.798041009824;40405;40411;40550;9275.257979361651;9412.905870941306;9473.905260947406;9487.430754154739;9501.334906556544;9347.85978210324;9461.57422915967;9466.905330946705;9467.763305917339;9483.33616646835;9431.528423578793;9469.384490008128;9471.526423678788;9482.525873706321;9530.285228607847;9396.812063758754;9450.385724927857;9456.385334953275;9457.19613832825;9473;9351.906480935171;9422.717318480456;9429.434233945985;9431.952840235823;9433.386829856106;38530.22939541194;38742.41886371707;38746.80626596849;38839.41740873889;38961.02597435058;3326.301476689898;3422.4866270059442;3464.34177506273;3485.7037151842123;3642.3261696586214;22650;28755.28111797201;29503.852480737674;30195.396092078034;30290;3160.2573395252098;3255.186203449138;3281.1633033576286;3317.4692049272244;3347.832608369572;436450.8177459092;439640;439683;441145;448276;54885;55141.44858551443;55149;55205.44794552003;55222.44777552253;55596.444035559936;56016.71991640097;57332.42667573354;57457.71271143617;57542.712286439135;15719.764203536955;15977.520674379555;15989.04065756035;15996.440124595583;16020.19899005045;12346.81479777804;12409.62771116868;12419.068569857296;12419.813702794465;12422.75154496905;13978.231197284043;14971.40114395412;15031.699366012619;15092.849071509365;15219.467318644016;6044.9395506044375;6140.447359737555;6162.907556386658;6180.6291622502795;6192.442680158807;842.9536375499406;931.9394239374419;966.6520052780993;967.67099186277;998.55065220651;21987.560248794933;25722.9878170559;28269.293267668472;29121.7087829119;29639.407211855643;974.3082411487782;1038.8780117473111;1059.3432072115183;1095.315427857589;1105.237386203517;14865.5540333788;14978;15026.323815428332;15339.233038348038;15349.386024559117;639208;646012;646112;646236;649605;55549.16676249859;55589.166162507594;55725.1641225382;55813;55940.44059559434;1307.078509650713;1352.3643887372918;1363.4750621010785;1365.1808914651328;1368.534698202596;26953.595696064967;28760;29053.54148367015;29391.26521836971;29531.852340738158;47022.52977470181;47491.762541187076;47578;47696.04607907753;47898.64709470304;579151;580569;583592;584162;585790.071049659;37649.247015058994;38030.80984595059;38113.04717382088;38309.4253586202;38480.23039539137;44674.77662611666;45138.54861451475;45594.316085258084;45672;45895.082098357176;36916.81541592275;37284;37360.25279494341;38287.61712382841;38824.894008479816;36345.636543634224;36404.453933190496;37081.258374831814;37349.81325093357;37453.25093498169;36453;36654.13533834574;37233.441498377004;37276;37339.813300933325;30271.394572107994;32913.67086329202;33015.66984330126;33030.009099727045;33068.33863322672;23134;23539.764602353756;24160.033598655857;24729.87635061813;24863.62704559469 12:47:58 INFO - PROCESS | 1950 | |2;jquery.html;310.29408096580283;348.59214718779026;365.3241503219045;367.08961774798485;399.67626222759566;14749.041312314692;15191.848081519182;16813.83186168138;19767.70348444771;19787.20851165955;18731;20260.290889818858;20352;20354.592908141865;20379.898100509512;4240.533541310453;5712.571557133221;5969.462748352647;5978.40215978403;6005.459508644221;4366.039471316305;6074.696265186745;6267.811965641015;6388.840278993016;6431.5819471734185;6162.568620196588;6397.10440538325;6404.967975160118;6552.7378904843745;6633.635150066744;6595.571287866273;6600.834979125512;6627.2378676452345;6641.302663220389;6648.16897887764;5023.397192336906;5289.338832645919;5323.494268044529;5351.331083614548;5382.946170538284;12570.182938108994;12642.620721378373;12656.430460629294;12823.166494177849;12864.678383040406;2165.1447678167037;2268.126771193086;2381.3332266965276;2403.8197135214928;2749.8725522535665;7870.606469676551;9665;9945.353552019096;12109.789021097908;15013.89534481228;1749.7725295711602;1752.737089436582;1813.6554054729559;1821.817818218181;1830.3136323878546;80688.78966815502;100645;120023.79976200213;123318.38340808329;124763;11011.559537618405;11048.723781905517;11103.444827758742;11170.385628790495;11380.317180969168;14111.717765644835;14125.011249212457;14153.787693184611;14164.22096784666;14166.079204851652;7859.567723775133;8105;8184.181581841768;8288.751337459886;8311.501309921425;8029.959850200712;8030.879536806952;8035;8191.959040204761;8200.58997050145;3808.5429748430365;4004.279229738617;4294.89262768427;4295.763732994716;4395.428594282786;1822.3712819077398;1877.6150889067708;1887.3016983716113;1893.7632795900513;1922.2311075569885;804.2640983500032;835.3567752830287;839.1608391608391;923.5936188077225;959.9856002159974;19850.60298794045;20628.484287892923;20650.27724029682;20785.688214676793;21014.579708405745;836.2264904962885;847.2374862623687;915.46445329483;917.3807679816231;976.097110173087;9622.37454565451;10448.947755261328;10631.46842657864;10887.891121088845;10900.781984360268;544303;561113;562238;575505;580728;68582;91366;96027;115139;120315.195272071;937.8640097186006;947.2564037230741;975.024975024975;975.2441857560306;976.5898322704481;17841.553961150556;18555.443336699922;18744.906275468536;18776.718349225044;18797.872127671835;42790.786046069574;49340.50659493359;51460.228096577834;51840.481595185076;53540.73229633827;71980;73063.26936730565;73877;74088;75268;7002.474814388839;7798.6490607923915;7814.296713295831;7887.250711182429;7942.444028918151;10685.51915163804;12760.879551037735;13068.607941761762;13101.475940962255;13384.464621415034;10651.230680023094;10913.23607347478;10966.725831853948;11126;11166.944165279121;10423.94788026055;10687.625933092304;10979.231453798158;11124.888751112385;11236.887631123911;10289.765228172368;10884.238103333008;11801.40992950332;11846;11877.990370818578;6892.620905850025;6968.581885086911;7228.31331023552;7253.782386528413;7444.776656700307;9642.903570964481;10977.890221097687;11280.830787538029;11426.542938282375;11433.828492572784 12:47:58 INFO - PROCESS | 1950 | |3;mootools.html;1455.8471360507147;1480.0157894999825;1635.4766474728085;1817.4456790678837;1838.76096107506;8337.24964753172;8838.337124715656;8848.159424854637;8851.601677924493;8862.645494180226;7655;7981.1220765715725;7983.640736166872;8041.075276343222;8049.1950804919625;2106.3154474795715;2241.1035585765744;2322.7677232276806;2325.3140323604493;2332.055517515409;2019.3538067818304;2248.740705205082;2287.2452090810075;2296.242240060776;2319.489712263299;2315.641075633271;2322.8025617822423;2327.6857624220766;2328.125858683759;2330.778576035274;2259.9209027684033;2303.953920921589;2305.262316058862;2305.4005958450925;2307.8846057697046;2275.397019789757;2291.6562515622622;2293.6330187169974;2300.7124109486313;2301.5166814968875;8618.741437756877;8640.39517233794;8729.34529910253;8730.650773969033;8755.299576033902;5107.055194788976;5276.736163191864;5284.180951952453;5285.101532739443;5289.153735402318;3037.6810434904237;3432.5366075579727;3541.1501239702543;3637.018005138624;3638.108663377463;947.1712251779693;1003.9096481316643;1083.5232497701065;1083.853679753239;1086.0768346905147;11457.713557161054;11483.138764592606;11502.769944601145;11505.194636375374;11513.963743263062;4340.240457919851;4522.638188944877;4700.482946875841;4722.268048452426;4726.385569875894;9696.17582505495;9789.853152202722;9802.705918822447;9815.656452024145;9837.065478779505;5258.027264955996;5266.262723218752;5284.207368894697;5296.285001524745;5298.337707786527;4688.0858232644305;4775.808967641256;4830.3479030331155;4832.299316599074;4833.685810422311;3809.1810260794064;3849.9615003850163;3892.143728379752;3923.47033150521;3925.548561915359;1110.8000559899297;1244.2285782814713;1254.3352023427415;1260.5714057220405;1275.7257189704258;787.8857565653063;846.1031306814796;895.4285229422322;925.6390007896925;951.2390087929629;5780.826575202751;5794.101914203306;5987.191729116601;6103.725332360054;6169.598976066542;824.6041899888087;896.7040876510736;896.8699538566872;911.886014248219;932.2914584915513;3907.6873850091924;3982.203559288154;4086.0602061526015;4094.8566800161852;4225.028243504012;9590.280728945358;10702.571897124184;10705.197110216764;10714.089302409227;10730.78538429227;10665.786684266272;10686.305390149615;10689;10698.197635177392;10700.678979630467;7967;8202.138775428613;8203.384746144064;8217.712380066549;8226.670933162726;5652.689102099424;5870.823875283749;6025.307089684742;6045.335013148638;6088.117223002729;9660.71017869465;9884.505774711091;9958;9980.650677226262;9992.850107248252;9599.568019439002;9981.550830212804;9994.150497207527;10005.249606279413;10201.693949181536;6774.93225067743;7022.473314501535;7051.365377116084;7106.147262328554;7110.146782386147;7695.461317707706;7803.375729941477;7985;8098.473599216032;8243.134470880472;7254.093238345207;7583.62081895892;7715.691372345268;7725.729599464216;7727.613619319124;7449.4412919032375;7494.775156745306;7497.512661676974;7543.811404714706;7547.433942454448;6736.181231067682;6888.621125838127;6891.896621550581;6902.275261097713;6930.653467326512;4524.095180963886;5015.398152221756;5149.588032957429;5152.690838549699;5235.81674641401;4930;5081.568066714371;5126.589872810092;5187.818426355059;5299.6290259681455 12:47:58 INFO - PROCESS | 1950 | |4;prototype.html;290.3698973228096;292.21831600468744;302.62021163439874;308.2248145913028;308.54027499026455;4971.9502804971935;5065.949340506594;5072.28987941688;5072.365954255718;5076.1370567003605;4700.271457924018;4895.853124406264;4920.114379411713;4941.60467162627;5031.371078615173;3802.182530755887;3826.368649172883;3834.7699138051667;3854.7879866607327;3863.942040869389;3732.4774531565604;3898.083950271684;3905.6875449964077;3955.5055618047745;3965;3812;3814.2024123332517;3863.4932376373235;3921.8823435296986;3936.2914675358566;3544.5392099027217;3544.8227588620725;3884.184321292532;3937.822797974098;3942.4086387041884;2860.599516067752;3003.189138932476;3289.342131573671;3412.6246112927556;3436.7489294512134;4019;4873.902521949542;4916.827911023132;4953;5053.267276244961;4135.276326642826;4384.7369157850635;4410.735355878657;4460.643148548141;4485.1254005468945;4382.824687012516;5289.942011597657;5305.071612467803;5308.867278318035;5315.123004704219;3768.8505005973166;3774.3960966245268;3782.9432558511644;3786.9053273668105;3794.886153415402;4669.809198654321;5314.5216930476445;5517.393086760453;5598.412166722476;5635.887282254332;3204.022773054194;3283.9835800820842;3719.5350581177354;3786.8106594670157;3794.753341032824;3447.775894566845;3862.4399462078404;3873.69010479161;3899.6212310490578;3901.8244179012013;3838.865639702597;4230.667339787957;4280.957190428056;4487.304467807495;4524.932126018112;4481.619062379734;5319.867003324948;5322.520973112439;5342.652727572696;5419.864503387368;1190.1668831817763;1230.3786587773295;1265.3293754310046;1309.5547513845147;1341.3025226881966;830.7424698343533;854.9868405938983;857.7091477326708;860.9225169734754;866.5147517390282;3910.452536644872;4251.6598672106775;4816.843957450186;4876.439209490883;5063.797448102035;4499.615203941916;5533.762748792002;5556.944430555643;5565.41563135873;5647.802326918538;4303.74177549348;4621.23749581322;4712.9057418851435;4846.345743324677;5086.872828179251;2730.645016147888;2751.9817667463167;2840.1882136684944;2868.4119755450083;2916.83957382346;5288.524032837063;5651.858703532444;5653.293338332708;5659.179418984224;5714.628549144292;4524.819007239739;5221.903400285906;5259.8422047338645;5332.240360680966;5653.293338332708;4823.397075365579;5207.192885102815;5234.246527413283;5420.184238280221;5654.349749778746;5132.947745712195;5477.698726570077;5477.972610137083;5520.68758744766;5545.340075550118;4579.404677392051;5399.433059528693;5407.864803379947;5416.8645783854145;5454.699991500505;5644.8306550803545;5681.488666020078;5696.658200507983;5753.1945527627;5757.625754325955;3175.6189257289275;3186.980166346747;3188.88838890647;3202.4876019836715;3364.697177253961;4755.6208699476765;5443.346798384219;5473.863153421196;5478.904618704643;5515.558755299647;4921.2864134700985;5154.561862241751;5294.682319060868;5322.760475778677;5383.1117865553315;4459.862735002554;4491.393661855738;5029.622778291716;5398.568114550905;5428.945710542844;4976.626752993612;5228.085085110167;5243.528082472596;5254.868628284324;5282.4717528246865;4317.654587632919;4435.645148388056;4905.607551395951;5254.97372513135;5259.763310650953;4817.421909370898;5214.608904332266;5239.318888544617;5243.737813109253;5247.291615631993 12:47:58 INFO - PROCESS | 1950 | |5;yui.html;610.6946526736632;729.2270193594793;731.4258307228827;776.9883451748221;804.6660635836126;14878.10731356118;15656.843431565681;15657.451989180381;15688.529344119695;15714.0571565706;13917.652058698537;14031.859681403183;14044;14072.577822665311;14079.084859484126;653.3140202787079;676.7665155521337;677.2178134254943;806.4516129032256;816.5631387207845;825.3438516379463;826.5082276045744;833.8874251975966;838.5597561280316;839.1273076000982;883.2139395937621;884.9823003539925;885.5041176940933;886.6586364249746;888.3470649072926;681.58082779091;874.9475031498131;875.52284005217;875.7547886591765;877.140402405646;527.6280222443169;528.0389690762813;528.7118520406387;529.5313647422021;530.059145017593;13765.38055787492;14262.714745705029;14359.78460323096;14603.70792584153;14618;13882.4447022119;14318.92840535801;14595.78106328406;14609.269536523132;14618.561443156723;11352.318860868374;11699.766004679945;11733.237339572986;11774.587889423829;12093.93953030238;3720.609336019706;3729.645683660075;3751.174741556853;3836.712246581518;3870.148567315186;104129;106653;108044.4597777014;108747.91252087457;108858;10529.526171322308;10715.678529644123;10779.838302425469;10792.136629069813;10888.346699198073;21055.578888422147;21086.47283817917;21095.789042109383;21095.894520527607;21097.894510527654;7158.498905076594;7519.699212031457;7565.886511702329;7741.303282704471;7838.176991415933;4297.140571885635;4448.088141930896;4471.6646251531265;4494.595486406239;4551.544845515422;3437.1063523483576;3584.426491761306;3612.548431446069;3612.837422316002;3617.276544691072;573.3922042634821;665.0363831563837;690.7168061095027;693.8508220732567;695.8956156576554;528.4741682026331;602.8462742000762;606.2932844044002;611.135243630267;657.2868437745004;8750.86873696895;8916.777080572907;9147.131022552847;9518.571664275125;10186.902838449689;554.7864072332101;557.946995035471;641.0925409628308;657.4575974820792;665.3014334948285;4156.459660244149;4626.421697287839;4643.976780116145;4704.388429504143;4760.857174284777;87329.56335218283;113689;147357;148767;159659;125747.74252257543;128629.42741145125;128743;129124;130196;68001;68920;94134;99593;108389;8497.405181637227;8576.785580360542;8901.73294801157;9008.38266258793;9018.368714190206;60033.799324012405;61013.779724404376;61391;62124.689376554634;62476.19047619047;88460;91663.08336916546;93763;94780;97547;10934.453277335942;11647.30116193031;11836.408179591159;11859.288442693465;11998.700032499257;12771.872281277068;12822.487100516248;12930.768848466552;13308.134971226838;13573.86426135726;8454.957725211334;11019.779604408028;11025.503852326825;11081.556737730723;11386.089112871116;11811.316451051342;13180.143290686075;13474;13544.59366219015;13628.70527299905;13299.401526931118;13308.534201302908;13585.86414135846;13648.522301719393;13956;10813.567457301935;11026.282543536136;11242.94378528102;11327.943360283145;11580.768384632092;10451.268411211142;11315.943420282845;11471.082313415074;11503.769924601294;11590.362530060927 12:47:58 INFO - PROCESS | 1950 | __end_tp_report 12:47:58 INFO - PROCESS | 1950 | __start_cc_report 12:47:58 INFO - PROCESS | 1950 | _x_x_mozilla_cycle_collect,2013 12:47:58 INFO - PROCESS | 1950 | __end_cc_report 12:47:58 INFO - PROCESS | 1950 | __startTimestamp1476215278046__endTimestamp 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - PROCESS | 1950 | ------- Summary: start ------- 12:47:58 INFO - PROCESS | 1950 | Number of tests: 6 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - PROCESS | 1950 | [#0] dojo.html Cycles:165 Average:5656.57 Median:5865.12 stddev:658.44 (11.2%) stddev-sans-first:620.54 12:47:58 INFO - PROCESS | 1950 | Values: 2778.4 2942.5 3238.4 3256.9 3297.8 5468.2 5554.4 5600.0 5615.4 5631.4 5580.2 5582.9 5599.5 5600.9 5603.4 5072.9 5106.3 5118.1 5175.4 5214.5 5169.4 5235.0 5243.6 5248.7 5253.2 4499.2 5129.2 5158.0 5167.0 5177.2 5236.3 5237.1 5264.1 5268.9 5283.7 5036.1 5052.8 5109.6 5151.3 5171.8 5470.8 5555.1 5565.2 5597.5 5604.0 6090.1 6097.1 6105.8 6110.4 6150.2 5441.4 6064.0 6095.7 6136.5 6213.7 5631.7 5661.3 5672.6 5700.1 5743.4 6274.1 6302.9 6309.4 6313.5 6327.4 5644.5 5839.2 5942.9 6046.0 6072.0 6118.2 6123.8 6148.0 6200.0 6234.3 6161.2 6161.3 6164.9 6165.0 6175.7 6166.2 6177.1 6188.0 6197.0 6198.8 4749.5 4811.8 4827.9 4878.5 4882.2 4379.8 4397.1 4400.2 4423.2 4430.3 5524.3 5577.2 5583.9 5590.9 5593.5 6138.6 6141.6 6143.5 6149.6 6164.2 5604.6 5617.2 5651.7 5679.4 5683.7 5289.7 5297.7 5303.7 5315.3 5326.3 6132.5 6300.7 6306.7 6312.8 6328.7 5916.9 5990.0 6098.5 6177.9 6200.3 6276.6 6286.2 6299.1 6304.8 6310.4 6111.8 6122.2 6131.8 6132.1 6151.4 5904.1 5987.4 6061.8 6124.5 6166.2 6048.1 6072.6 6107.3 6125.1 6145.0 6026.4 6039.1 6055.1 6065.4 6074.6 5683.2 5829.8 5861.8 5881.8 5915.2 5881.9 5955.3 5968.5 5987.1 6019.4 5847.6 5865.1 5884.2 5896.9 5916.1 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - PROCESS | 1950 | [#1] ext.html Cycles:180 Average:68301.41 Median:39089.01 stddev:150594.97 (385.3%) stddev-sans-first:150931.27 12:47:58 INFO - PROCESS | 1950 | Values: 451.9 499.1 504.4 511.4 515.0 29278.9 38281.4 39217.0 39274.3 41474.6 40006.4 40391.8 40405.0 40411.0 40550.0 9275.3 9412.9 9473.9 9487.4 9501.3 9347.9 9461.6 9466.9 9467.8 9483.3 9431.5 9469.4 9471.5 9482.5 9530.3 9396.8 9450.4 9456.4 9457.2 9473.0 9351.9 9422.7 9429.4 9432.0 9433.4 38530.2 38742.4 38746.8 38839.4 38961.0 3326.3 3422.5 3464.3 3485.7 3642.3 22650.0 28755.3 29503.9 30195.4 30290.0 3160.3 3255.2 3281.2 3317.5 3347.8 436450.8 439640.0 439683.0 441145.0 448276.0 54885.0 55141.4 55149.0 55205.4 55222.4 55596.4 56016.7 57332.4 57457.7 57542.7 15719.8 15977.5 15989.0 15996.4 16020.2 12346.8 12409.6 12419.1 12419.8 12422.8 13978.2 14971.4 15031.7 15092.8 15219.5 6044.9 6140.4 6162.9 6180.6 6192.4 843.0 931.9 966.7 967.7 998.6 21987.6 25723.0 28269.3 29121.7 29639.4 974.3 1038.9 1059.3 1095.3 1105.2 14865.6 14978.0 15026.3 15339.2 15349.4 639208.0 646012.0 646112.0 646236.0 649605.0 55549.2 55589.2 55725.2 55813.0 55940.4 1307.1 1352.4 1363.5 1365.2 1368.5 26953.6 28760.0 29053.5 29391.3 29531.9 47022.5 47491.8 47578.0 47696.0 47898.6 579151.0 580569.0 583592.0 584162.0 585790.1 37649.2 38030.8 38113.0 38309.4 38480.2 44674.8 45138.5 45594.3 45672.0 45895.1 36916.8 37284.0 37360.3 38287.6 38824.9 36345.6 36404.5 37081.3 37349.8 37453.3 36453.0 36654.1 37233.4 37276.0 37339.8 30271.4 32913.7 33015.7 33030.0 33068.3 23134.0 23539.8 24160.0 24729.9 24863.6 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - PROCESS | 1950 | [#2] jquery.html Cycles:180 Average:32311.12 Median:2104.11 stddev:93822.02 (4459.0%) stddev-sans-first:94054.44 12:47:58 INFO - PROCESS | 1950 | Values: 310.3 348.6 365.3 367.1 399.7 14749.0 15191.8 16813.8 19767.7 19787.2 18731.0 20260.3 20352.0 20354.6 20379.9 4240.5 5712.6 5969.5 5978.4 6005.5 4366.0 6074.7 6267.8 6388.8 6431.6 6162.6 6397.1 6405.0 6552.7 6633.6 6595.6 6600.8 6627.2 6641.3 6648.2 5023.4 5289.3 5323.5 5351.3 5382.9 12570.2 12642.6 12656.4 12823.2 12864.7 2165.1 2268.1 2381.3 2403.8 2749.9 7870.6 9665.0 9945.4 12109.8 15013.9 1749.8 1752.7 1813.7 1821.8 1830.3 80688.8 100645.0 120023.8 123318.4 124763.0 11011.6 11048.7 11103.4 11170.4 11380.3 14111.7 14125.0 14153.8 14164.2 14166.1 7859.6 8105.0 8184.2 8288.8 8311.5 8030.0 8030.9 8035.0 8192.0 8200.6 3808.5 4004.3 4294.9 4295.8 4395.4 1822.4 1877.6 1887.3 1893.8 1922.2 804.3 835.4 839.2 923.6 960.0 19850.6 20628.5 20650.3 20785.7 21014.6 836.2 847.2 915.5 917.4 976.1 9622.4 10448.9 10631.5 10887.9 10900.8 544303.0 561113.0 562238.0 575505.0 580728.0 68582.0 91366.0 96027.0 115139.0 120315.2 937.9 947.3 975.0 975.2 976.6 17841.6 18555.4 18744.9 18776.7 18797.9 42790.8 49340.5 51460.2 51840.5 53540.7 71980.0 73063.3 73877.0 74088.0 75268.0 7002.5 7798.6 7814.3 7887.3 7942.4 10685.5 12760.9 13068.6 13101.5 13384.5 10651.2 10913.2 10966.7 11126.0 11166.9 10423.9 10687.6 10979.2 11124.9 11236.9 10289.8 10884.2 11801.4 11846.0 11878.0 6892.6 6968.6 7228.3 7253.8 7444.8 9642.9 10977.9 11280.8 11426.5 11433.8 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - PROCESS | 1950 | [#3] mootools.html Cycles:180 Average:5646.68 Median:5262.14 stddev:3153.82 (59.9%) stddev-sans-first:3146.95 12:47:58 INFO - PROCESS | 1950 | Values: 1455.8 1480.0 1635.5 1817.4 1838.8 8337.2 8838.3 8848.2 8851.6 8862.6 7655.0 7981.1 7983.6 8041.1 8049.2 2106.3 2241.1 2322.8 2325.3 2332.1 2019.4 2248.7 2287.2 2296.2 2319.5 2315.6 2322.8 2327.7 2328.1 2330.8 2259.9 2304.0 2305.3 2305.4 2307.9 2275.4 2291.7 2293.6 2300.7 2301.5 8618.7 8640.4 8729.3 8730.7 8755.3 5107.1 5276.7 5284.2 5285.1 5289.2 3037.7 3432.5 3541.2 3637.0 3638.1 947.2 1003.9 1083.5 1083.9 1086.1 11457.7 11483.1 11502.8 11505.2 11514.0 4340.2 4522.6 4700.5 4722.3 4726.4 9696.2 9789.9 9802.7 9815.7 9837.1 5258.0 5266.3 5284.2 5296.3 5298.3 4688.1 4775.8 4830.3 4832.3 4833.7 3809.2 3850.0 3892.1 3923.5 3925.5 1110.8 1244.2 1254.3 1260.6 1275.7 787.9 846.1 895.4 925.6 951.2 5780.8 5794.1 5987.2 6103.7 6169.6 824.6 896.7 896.9 911.9 932.3 3907.7 3982.2 4086.1 4094.9 4225.0 9590.3 10702.6 10705.2 10714.1 10730.8 10665.8 10686.3 10689.0 10698.2 10700.7 7967.0 8202.1 8203.4 8217.7 8226.7 5652.7 5870.8 6025.3 6045.3 6088.1 9660.7 9884.5 9958.0 9980.7 9992.9 9599.6 9981.6 9994.2 10005.2 10201.7 6774.9 7022.5 7051.4 7106.1 7110.1 7695.5 7803.4 7985.0 8098.5 8243.1 7254.1 7583.6 7715.7 7725.7 7727.6 7449.4 7494.8 7497.5 7543.8 7547.4 6736.2 6888.6 6891.9 6902.3 6930.7 4524.1 5015.4 5149.6 5152.7 5235.8 4930.0 5081.6 5126.6 5187.8 5299.6 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - PROCESS | 1950 | [#4] prototype.html Cycles:180 Average:4305.01 Median:4834.87 stddev:1320.94 (27.3%) stddev-sans-first:1289.82 12:47:58 INFO - PROCESS | 1950 | Values: 290.4 292.2 302.6 308.2 308.5 4972.0 5065.9 5072.3 5072.4 5076.1 4700.3 4895.9 4920.1 4941.6 5031.4 3802.2 3826.4 3834.8 3854.8 3863.9 3732.5 3898.1 3905.7 3955.5 3965.0 3812.0 3814.2 3863.5 3921.9 3936.3 3544.5 3544.8 3884.2 3937.8 3942.4 2860.6 3003.2 3289.3 3412.6 3436.7 4019.0 4873.9 4916.8 4953.0 5053.3 4135.3 4384.7 4410.7 4460.6 4485.1 4382.8 5289.9 5305.1 5308.9 5315.1 3768.9 3774.4 3782.9 3786.9 3794.9 4669.8 5314.5 5517.4 5598.4 5635.9 3204.0 3284.0 3719.5 3786.8 3794.8 3447.8 3862.4 3873.7 3899.6 3901.8 3838.9 4230.7 4281.0 4487.3 4524.9 4481.6 5319.9 5322.5 5342.7 5419.9 1190.2 1230.4 1265.3 1309.6 1341.3 830.7 855.0 857.7 860.9 866.5 3910.5 4251.7 4816.8 4876.4 5063.8 4499.6 5533.8 5556.9 5565.4 5647.8 4303.7 4621.2 4712.9 4846.3 5086.9 2730.6 2752.0 2840.2 2868.4 2916.8 5288.5 5651.9 5653.3 5659.2 5714.6 4524.8 5221.9 5259.8 5332.2 5653.3 4823.4 5207.2 5234.2 5420.2 5654.3 5132.9 5477.7 5478.0 5520.7 5545.3 4579.4 5399.4 5407.9 5416.9 5454.7 5644.8 5681.5 5696.7 5753.2 5757.6 3175.6 3187.0 3188.9 3202.5 3364.7 4755.6 5443.3 5473.9 5478.9 5515.6 4921.3 5154.6 5294.7 5322.8 5383.1 4459.9 4491.4 5029.6 5398.6 5428.9 4976.6 5228.1 5243.5 5254.9 5282.5 4317.7 4435.6 4905.6 5255.0 5259.8 4817.4 5214.6 5239.3 5243.7 5247.3 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - PROCESS | 1950 | [#5] yui.html Cycles:180 Average:23455.12 Median:3725.13 stddev:37193.96 (998.5%) stddev-sans-first:37258.74 12:47:58 INFO - PROCESS | 1950 | Values: 610.7 729.2 731.4 777.0 804.7 14878.1 15656.8 15657.5 15688.5 15714.1 13917.7 14031.9 14044.0 14072.6 14079.1 653.3 676.8 677.2 806.5 816.6 825.3 826.5 833.9 838.6 839.1 883.2 885.0 885.5 886.7 888.3 681.6 874.9 875.5 875.8 877.1 527.6 528.0 528.7 529.5 530.1 13765.4 14262.7 14359.8 14603.7 14618.0 13882.4 14318.9 14595.8 14609.3 14618.6 11352.3 11699.8 11733.2 11774.6 12093.9 3720.6 3729.6 3751.2 3836.7 3870.1 104129.0 106653.0 108044.5 108747.9 108858.0 10529.5 10715.7 10779.8 10792.1 10888.3 21055.6 21086.5 21095.8 21095.9 21097.9 7158.5 7519.7 7565.9 7741.3 7838.2 4297.1 4448.1 4471.7 4494.6 4551.5 3437.1 3584.4 3612.5 3612.8 3617.3 573.4 665.0 690.7 693.9 695.9 528.5 602.8 606.3 611.1 657.3 8750.9 8916.8 9147.1 9518.6 10186.9 554.8 557.9 641.1 657.5 665.3 4156.5 4626.4 4644.0 4704.4 4760.9 87329.6 113689.0 147357.0 148767.0 159659.0 125747.7 128629.4 128743.0 129124.0 130196.0 68001.0 68920.0 94134.0 99593.0 108389.0 8497.4 8576.8 8901.7 9008.4 9018.4 60033.8 61013.8 61391.0 62124.7 62476.2 88460.0 91663.1 93763.0 94780.0 97547.0 10934.5 11647.3 11836.4 11859.3 11998.7 12771.9 12822.5 12930.8 13308.1 13573.9 8455.0 11019.8 11025.5 11081.6 11386.1 11811.3 13180.1 13474.0 13544.6 13628.7 13299.4 13308.5 13585.9 13648.5 13956.0 10813.6 11026.3 11242.9 11327.9 11580.8 10451.3 11315.9 11471.1 11503.8 11590.4 12:47:58 INFO - PROCESS | 1950 | -------- Summary: end -------- 12:47:58 INFO - PROCESS | 1950 | 12:47:58 INFO - TEST-INFO | 1950: exit 0 12:47:58 INFO - TEST-OK | dromaeo_css | took 1118784ms 12:47:58 INFO - TEST-START | kraken 12:47:58 INFO - operating with platform_type : mac_ 12:47:58 INFO - Initialising browser for kraken test... 12:47:58 INFO - TEST-INFO | started process 1953 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/tmpfypICH/profile http://localhost:57237/getInfo.html) 12:48:01 INFO - PROCESS | 1953 | __metrics Screen width/height:1600/1200 12:48:01 INFO - PROCESS | 1953 | colorDepth:24 12:48:01 INFO - PROCESS | 1953 | Browser inner width/height: 1024/689 12:48:01 INFO - PROCESS | 1953 | __metrics 12:48:01 INFO - PROCESS | 1953 | 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" 12:48:01 INFO - PROCESS | 1953 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:48:01 INFO - TEST-INFO | 1953: exit 0 12:48:01 INFO - Browser initialized. 12:48:01 INFO - Running cycle 1/1 for kraken test... 12:48:01 INFO - TEST-INFO | started process 1954 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/T/tmpfypICH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:48:14 INFO - PROCESS | 1954 | RSS: Main: 234807296 12:48:14 INFO - PROCESS | 1954 | 12:48:16 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:57237/tests/kraken/driver.html?testName=audio-beat-detection) 12:48:17 INFO - PROCESS | 1954 | RSS: Main: 293769216 12:48:17 INFO - PROCESS | 1954 | 12:48:20 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:57237/tests/kraken/driver.html?testName=audio-dft) 12:48:21 INFO - PROCESS | 1954 | RSS: Main: 294350848 12:48:21 INFO - PROCESS | 1954 | 12:48:24 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:57237/tests/kraken/driver.html?testName=audio-fft) 12:48:25 INFO - PROCESS | 1954 | RSS: Main: 385413120 12:48:25 INFO - PROCESS | 1954 | 12:48:27 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:57237/tests/kraken/driver.html?testName=audio-oscillator) 12:48:27 INFO - PROCESS | 1954 | RSS: Main: 286838784 12:48:27 INFO - PROCESS | 1954 | 12:48:29 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:57237/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:48:30 INFO - PROCESS | 1954 | RSS: Main: 289701888 12:48:30 INFO - PROCESS | 1954 | 12:48:33 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:57237/tests/kraken/driver.html?testName=imaging-darkroom) 12:48:33 INFO - PROCESS | 1954 | RSS: Main: 326639616 12:48:33 INFO - PROCESS | 1954 | 12:48:36 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:57237/tests/kraken/driver.html?testName=imaging-desaturate) 12:48:37 INFO - PROCESS | 1954 | RSS: Main: 327622656 12:48:37 INFO - PROCESS | 1954 | 12:48:39 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:57237/tests/kraken/driver.html?testName=json-parse-financial) 12:48:40 INFO - PROCESS | 1954 | RSS: Main: 327639040 12:48:40 INFO - PROCESS | 1954 | 12:48:42 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:57237/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:48:42 INFO - PROCESS | 1954 | RSS: Main: 300822528 12:48:42 INFO - PROCESS | 1954 | 12:48:44 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:57237/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:48:45 INFO - PROCESS | 1954 | RSS: Main: 305758208 12:48:45 INFO - PROCESS | 1954 | 12:48:47 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:57237/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:48:48 INFO - PROCESS | 1954 | RSS: Main: 312139776 12:48:48 INFO - PROCESS | 1954 | 12:48:51 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:57237/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:48:52 INFO - PROCESS | 1954 | RSS: Main: 322252800 12:48:52 INFO - PROCESS | 1954 | 12:48:54 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:57237/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:48:55 INFO - PROCESS | 1954 | RSS: Main: 321425408 12:48:55 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | Cycle 1(1): loaded http://localhost:57237/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:57237/tests/kraken/driver.html?testName=ai-astar) 12:48:57 INFO - PROCESS | 1954 | RSS: Main: 365719552 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | __start_tp_report 12:48:57 INFO - PROCESS | 1954 | _x_x_mozilla_page_load 12:48:57 INFO - PROCESS | 1954 | _x_x_mozilla_page_load_details 12:48:57 INFO - PROCESS | 1954 | |i|pagename|runs| 12:48:57 INFO - PROCESS | 1954 | |0;ai-astar;112;115;112;113;114;114;113;111;113;113 12:48:57 INFO - PROCESS | 1954 | |1;audio-beat-detection;153;116;113;150;134;137;104;132;179;139 12:48:57 INFO - PROCESS | 1954 | |2;audio-dft;185;183;185;184;184;183;184;183;181;183 12:48:57 INFO - PROCESS | 1954 | |3;audio-fft;78;61;75;112;84;59;59;59;84;58 12:48:57 INFO - PROCESS | 1954 | |4;audio-oscillator;83;72;96;71;68;69;93;68;69;91 12:48:57 INFO - PROCESS | 1954 | |5;imaging-gaussian-blur;87;85;89;85;89;85;88;86;89;85 12:48:57 INFO - PROCESS | 1954 | |6;imaging-darkroom;97;98;98;97;97;98;97;97;97;97 12:48:57 INFO - PROCESS | 1954 | |7;imaging-desaturate;97;87;91;87;88;88;90;90;89;91 12:48:57 INFO - PROCESS | 1954 | |8;json-parse-financial;55;53;53;53;55;55;56;55;56;54 12:48:57 INFO - PROCESS | 1954 | |9;json-stringify-tinderbox;65;72;71;70;75;76;72;71;71;75 12:48:57 INFO - PROCESS | 1954 | |10;stanford-crypto-aes;85;90;96;87;87;87;87;90;90;93 12:48:57 INFO - PROCESS | 1954 | |11;stanford-crypto-ccm;152;159;144;137;157;146;147;133;180;162 12:48:57 INFO - PROCESS | 1954 | |12;stanford-crypto-pbkdf2;171;173;171;168;171;177;234;172;169;170 12:48:57 INFO - PROCESS | 1954 | |13;stanford-crypto-sha256-iterative;69;70;69;68;68;69;68;69;68;69 12:48:57 INFO - PROCESS | 1954 | __end_tp_report 12:48:57 INFO - PROCESS | 1954 | __start_cc_report 12:48:57 INFO - PROCESS | 1954 | _x_x_mozilla_cycle_collect,2038 12:48:57 INFO - PROCESS | 1954 | __end_cc_report 12:48:57 INFO - PROCESS | 1954 | __startTimestamp1476215337587__endTimestamp 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | ------- Summary: start ------- 12:48:57 INFO - PROCESS | 1954 | Number of tests: 14 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#0] ai-astar Cycles:10 Average:113.00 Median:113.00 stddev:1.15 (1.0%) stddev-sans-first:1.17 12:48:57 INFO - PROCESS | 1954 | Values: 112.0 115.0 112.0 113.0 114.0 114.0 113.0 111.0 113.0 113.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#1] audio-beat-detection Cycles:10 Average:135.70 Median:138.00 stddev:21.90 (15.9%) stddev-sans-first:22.31 12:48:57 INFO - PROCESS | 1954 | Values: 153.0 116.0 113.0 150.0 134.0 137.0 104.0 132.0 179.0 139.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#2] audio-dft Cycles:10 Average:183.50 Median:184.00 stddev:1.18 (0.6%) stddev-sans-first:1.12 12:48:57 INFO - PROCESS | 1954 | Values: 185.0 183.0 185.0 184.0 184.0 183.0 184.0 183.0 181.0 183.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#3] audio-fft Cycles:10 Average:72.90 Median:68.00 stddev:17.48 (25.7%) stddev-sans-first:18.44 12:48:57 INFO - PROCESS | 1954 | Values: 78.0 61.0 75.0 112.0 84.0 59.0 59.0 59.0 84.0 58.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#4] audio-oscillator Cycles:10 Average:78.00 Median:77.50 stddev:11.50 (14.8%) stddev-sans-first:12.05 12:48:57 INFO - PROCESS | 1954 | Values: 83.0 72.0 96.0 71.0 68.0 69.0 93.0 68.0 69.0 91.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#5] imaging-gaussian-blur Cycles:10 Average:86.80 Median:87.50 stddev:1.81 (2.1%) stddev-sans-first:1.92 12:48:57 INFO - PROCESS | 1954 | Values: 87.0 85.0 89.0 85.0 89.0 85.0 88.0 86.0 89.0 85.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#6] imaging-darkroom Cycles:10 Average:97.30 Median:97.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 12:48:57 INFO - PROCESS | 1954 | Values: 97.0 98.0 98.0 97.0 97.0 98.0 97.0 97.0 97.0 97.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#7] imaging-desaturate Cycles:10 Average:89.80 Median:90.00 stddev:2.94 (3.3%) stddev-sans-first:1.58 12:48:57 INFO - PROCESS | 1954 | Values: 97.0 87.0 91.0 87.0 88.0 88.0 90.0 90.0 89.0 91.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#8] json-parse-financial Cycles:10 Average:54.50 Median:55.00 stddev:1.18 (2.1%) stddev-sans-first:1.24 12:48:57 INFO - PROCESS | 1954 | Values: 55.0 53.0 53.0 53.0 55.0 55.0 56.0 55.0 56.0 54.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#9] json-stringify-tinderbox Cycles:10 Average:71.80 Median:72.00 stddev:3.16 (4.4%) stddev-sans-first:2.19 12:48:57 INFO - PROCESS | 1954 | Values: 65.0 72.0 71.0 70.0 75.0 76.0 72.0 71.0 71.0 75.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#10] stanford-crypto-aes Cycles:10 Average:89.20 Median:90.00 stddev:3.33 (3.7%) stddev-sans-first:3.16 12:48:57 INFO - PROCESS | 1954 | Values: 85.0 90.0 96.0 87.0 87.0 87.0 87.0 90.0 90.0 93.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#11] stanford-crypto-ccm Cycles:10 Average:151.70 Median:154.50 stddev:13.61 (8.8%) stddev-sans-first:14.44 12:48:57 INFO - PROCESS | 1954 | Values: 152.0 159.0 144.0 137.0 157.0 146.0 147.0 133.0 180.0 162.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:177.60 Median:171.50 stddev:19.97 (11.6%) stddev-sans-first:21.04 12:48:57 INFO - PROCESS | 1954 | Values: 171.0 173.0 171.0 168.0 171.0 177.0 234.0 172.0 169.0 170.0 12:48:57 INFO - PROCESS | 1954 | 12:48:57 INFO - PROCESS | 1954 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.70 Median:69.00 stddev:0.67 (1.0%) stddev-sans-first:0.71 12:48:57 INFO - PROCESS | 1954 | Values: 69.0 70.0 69.0 68.0 68.0 69.0 68.0 69.0 68.0 69.0 12:48:57 INFO - PROCESS | 1954 | -------- Summary: end -------- 12:48:57 INFO - PROCESS | 1954 | 12:48:58 INFO - TEST-INFO | 1954: exit 0 12:48:58 INFO - TEST-OK | kraken | took 59778ms 12:48:58 INFO - SUITE-END | took 1178s 12:48:58 INFO - Completed test suite (00:19:38) 12:48:58 INFO - javascript benchmark 12:48:58 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2778.4443111377727, 2942.4703553360396, 3238.449463591189, 3256.853441595128, 3297.752668549859, 5468.207109969052, 5554.416786237448, 5600.0, 5615.354234263061, 5631.4087020862835, 5580.190872323511, 5582.91625625616, 5599.468050535203, 5600.943990560093, 5603.3836278009385, 5072.9492705072935, 5106.336176297076, 5118.129917913963, 5175.378954525462, 5214.530692237698, 5169.40551836538, 5235.0053489837, 5243.580513558906, 5248.68507889526, 5253.238280449333, 4499.212637788391, 5129.2306154077, 5158.045761534128, 5167.044096842096, 5177.223416487519, 5236.319278493809, 5237.057329680656, 5264.131418315973, 5268.894622107575, 5283.709395983219, 5036.118679231156, 5052.8484145475695, 5109.642325037249, 5151.278820965068, 5171.844844654666, 5470.835874923759, 5555.138953462219, 5565.193047008162, 5597.524210442118, 5604.047311956977, 6090.086487026937, 6097.054956481708, 6105.786297479567, 6110.419510146573, 6150.200473938359, 5441.401445840955, 6064.0, 6095.697388267035, 6136.539759518054, 6213.720382582795, 5631.71841407928, 5661.348944871352, 5672.5745569081655, 5700.087985922232, 5743.368229494752, 6274.090256912722, 6302.905456418157, 6309.432151106423, 6313.494920406357, 6327.367263273728, 5644.5484361251, 5839.240898683229, 5942.910856337158, 6046.032634778414, 6072.0, 6118.174046503754, 6123.83172914054, 6147.985582378947, 6199.969000155061, 6234.2830574483605, 6161.229846269216, 6161.260648722182, 6164.876702466016, 6164.969175154185, 6175.722092505848, 6166.229221347332, 6177.135201071854, 6187.969060154761, 6196.969015154986, 6198.783042593487, 4749.501302363271, 4811.759412029384, 4827.903441931142, 4878.487758785276, 4882.170031094652, 4379.759113248738, 4397.054633253866, 4400.185965596375, 4423.225935461282, 4430.291153415438, 5524.254225679482, 5577.247071645357, 5583.944160558342, 5590.944090559043, 5593.524550413261, 6138.602983405075, 6141.608749743955, 6143.539234557426, 6149.600275982047, 6164.198654175018, 5604.635698679573, 5617.21359009739, 5651.660900345993, 5679.403662615448, 5683.715814209273, 5289.735513224324, 5297.682139071591, 5303.655262407931, 5315.255864179018, 5326.2543243945875, 6132.5400594956445, 6300.7479700811455, 6306.684665766693, 6312.810615681628, 6328.71520781566, 5916.881662366814, 5989.9700501498955, 6098.522998456991, 6177.938220617916, 6200.3489633589625, 6276.592021518587, 6286.18279623646, 6299.149614801943, 6304.842378940563, 6310.400511951358, 6111.84720381994, 6122.204113465221, 6131.754729810757, 6132.08018797184, 6151.384861513813, 5904.143899134688, 5987.43119403656, 6061.848453788691, 6124.533510047433, 6166.229221347332, 6048.0625503047095, 6072.605280656743, 6107.267127944675, 6125.081237814364, 6144.969275153596, 6026.367231440636, 6039.094135879654, 6055.1220073090035, 6065.423784740443, 6074.635521868702, 5683.204351390891, 5829.8251052468495, 5861.7655293787775, 5881.823545293648, 5915.171875937458, 5881.941180588139, 5955.285365756137, 5968.522518198621, 5987.072003839412, 6019.367966363644, 5847.649141051551, 5865.120231965239, 5884.176215329771, 5896.9115463268945, 5916.083007133901], "value": 5610.686286742765, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [451.93569144664315, 499.06425452276983, 504.41235960106457, 511.4067681489473, 515.0445922813184, 29278.85360573197, 38281.425778613346, 39216.99999999996, 39274.341503406846, 41474.58525414745, 40006.39990400146, 40391.798041009824, 40405.0, 40411.0, 40550.0, 9275.257979361651, 9412.905870941306, 9473.905260947406, 9487.430754154739, 9501.334906556544, 9347.85978210324, 9461.57422915967, 9466.905330946705, 9467.763305917339, 9483.33616646835, 9431.528423578793, 9469.384490008128, 9471.526423678788, 9482.525873706321, 9530.285228607847, 9396.812063758754, 9450.385724927857, 9456.385334953275, 9457.19613832825, 9473.0, 9351.906480935171, 9422.717318480456, 9429.434233945985, 9431.952840235823, 9433.386829856106, 38530.22939541194, 38742.41886371707, 38746.80626596849, 38839.41740873889, 38961.02597435058, 3326.301476689898, 3422.4866270059442, 3464.34177506273, 3485.7037151842123, 3642.3261696586214, 22650.0, 28755.28111797201, 29503.852480737674, 30195.396092078034, 30290.0, 3160.2573395252098, 3255.186203449138, 3281.1633033576286, 3317.4692049272244, 3347.832608369572, 436450.8177459092, 439640.0, 439683.0, 441145.0, 448276.0, 54885.0, 55141.44858551443, 55149.0, 55205.44794552003, 55222.44777552253, 55596.444035559936, 56016.71991640097, 57332.42667573354, 57457.71271143617, 57542.712286439135, 15719.764203536955, 15977.520674379555, 15989.04065756035, 15996.440124595583, 16020.19899005045, 12346.81479777804, 12409.62771116868, 12419.068569857296, 12419.813702794465, 12422.75154496905, 13978.231197284043, 14971.40114395412, 15031.699366012619, 15092.849071509365, 15219.467318644016, 6044.9395506044375, 6140.447359737555, 6162.907556386658, 6180.6291622502795, 6192.442680158807, 842.9536375499406, 931.9394239374419, 966.6520052780993, 967.67099186277, 998.55065220651, 21987.560248794933, 25722.9878170559, 28269.293267668472, 29121.7087829119, 29639.407211855643, 974.3082411487782, 1038.8780117473111, 1059.3432072115183, 1095.315427857589, 1105.237386203517, 14865.5540333788, 14978.0, 15026.323815428332, 15339.233038348038, 15349.386024559117, 639208.0, 646012.0, 646112.0, 646236.0, 649605.0, 55549.16676249859, 55589.166162507594, 55725.1641225382, 55813.0, 55940.44059559434, 1307.078509650713, 1352.3643887372918, 1363.4750621010785, 1365.1808914651328, 1368.534698202596, 26953.595696064967, 28760.0, 29053.54148367015, 29391.26521836971, 29531.852340738158, 47022.52977470181, 47491.762541187076, 47578.0, 47696.04607907753, 47898.64709470304, 579151.0, 580569.0, 583592.0, 584162.0, 585790.071049659, 37649.247015058994, 38030.80984595059, 38113.04717382088, 38309.4253586202, 38480.23039539137, 44674.77662611666, 45138.54861451475, 45594.316085258084, 45672.0, 45895.082098357176, 36916.81541592275, 37284.0, 37360.25279494341, 38287.61712382841, 38824.894008479816, 36345.636543634224, 36404.453933190496, 37081.258374831814, 37349.81325093357, 37453.25093498169, 36453.0, 36654.13533834574, 37233.441498377004, 37276.0, 37339.813300933325, 30271.394572107994, 32913.67086329202, 33015.66984330126, 33030.009099727045, 33068.33863322672, 23134.0, 23539.764602353756, 24160.033598655857, 24729.87635061813, 24863.62704559469], "value": 19303.06626608373, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [310.29408096580283, 348.59214718779026, 365.3241503219045, 367.08961774798485, 399.67626222759566, 14749.041312314692, 15191.848081519182, 16813.83186168138, 19767.70348444771, 19787.20851165955, 18731.0, 20260.290889818858, 20352.0, 20354.592908141865, 20379.898100509512, 4240.533541310453, 5712.571557133221, 5969.462748352647, 5978.40215978403, 6005.459508644221, 4366.039471316305, 6074.696265186745, 6267.811965641015, 6388.840278993016, 6431.5819471734185, 6162.568620196588, 6397.10440538325, 6404.967975160118, 6552.7378904843745, 6633.635150066744, 6595.571287866273, 6600.834979125512, 6627.2378676452345, 6641.302663220389, 6648.16897887764, 5023.397192336906, 5289.338832645919, 5323.494268044529, 5351.331083614548, 5382.946170538284, 12570.182938108994, 12642.620721378373, 12656.430460629294, 12823.166494177849, 12864.678383040406, 2165.1447678167037, 2268.126771193086, 2381.3332266965276, 2403.8197135214928, 2749.8725522535665, 7870.606469676551, 9665.0, 9945.353552019096, 12109.789021097908, 15013.89534481228, 1749.7725295711602, 1752.737089436582, 1813.6554054729559, 1821.817818218181, 1830.3136323878546, 80688.78966815502, 100645.0, 120023.79976200213, 123318.38340808329, 124763.0, 11011.559537618405, 11048.723781905517, 11103.444827758742, 11170.385628790495, 11380.317180969168, 14111.717765644835, 14125.011249212457, 14153.787693184611, 14164.22096784666, 14166.079204851652, 7859.567723775133, 8105.0, 8184.181581841768, 8288.751337459886, 8311.501309921425, 8029.959850200712, 8030.879536806952, 8035.0, 8191.959040204761, 8200.58997050145, 3808.5429748430365, 4004.279229738617, 4294.89262768427, 4295.763732994716, 4395.428594282786, 1822.3712819077398, 1877.6150889067708, 1887.3016983716113, 1893.7632795900513, 1922.2311075569885, 804.2640983500032, 835.3567752830287, 839.1608391608391, 923.5936188077225, 959.9856002159974, 19850.60298794045, 20628.484287892923, 20650.27724029682, 20785.688214676793, 21014.579708405745, 836.2264904962885, 847.2374862623687, 915.46445329483, 917.3807679816231, 976.097110173087, 9622.37454565451, 10448.947755261328, 10631.46842657864, 10887.891121088845, 10900.781984360268, 544303.0, 561113.0, 562238.0, 575505.0, 580728.0, 68582.0, 91366.0, 96027.0, 115139.0, 120315.195272071, 937.8640097186006, 947.2564037230741, 975.024975024975, 975.2441857560306, 976.5898322704481, 17841.553961150556, 18555.443336699922, 18744.906275468536, 18776.718349225044, 18797.872127671835, 42790.786046069574, 49340.50659493359, 51460.228096577834, 51840.481595185076, 53540.73229633827, 71980.0, 73063.26936730565, 73877.0, 74088.0, 75268.0, 7002.474814388839, 7798.6490607923915, 7814.296713295831, 7887.250711182429, 7942.444028918151, 10685.51915163804, 12760.879551037735, 13068.607941761762, 13101.475940962255, 13384.464621415034, 10651.230680023094, 10913.23607347478, 10966.725831853948, 11126.0, 11166.944165279121, 10423.94788026055, 10687.625933092304, 10979.231453798158, 11124.888751112385, 11236.887631123911, 10289.765228172368, 10884.238103333008, 11801.40992950332, 11846.0, 11877.990370818578, 6892.620905850025, 6968.581885086911, 7228.31331023552, 7253.782386528413, 7444.776656700307, 9642.903570964481, 10977.890221097687, 11280.830787538029, 11426.542938282375, 11433.828492572784], "value": 9081.022684759466, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1455.8471360507147, 1480.0157894999825, 1635.4766474728085, 1817.4456790678837, 1838.76096107506, 8337.24964753172, 8838.337124715656, 8848.159424854637, 8851.601677924493, 8862.645494180226, 7655.0, 7981.1220765715725, 7983.640736166872, 8041.075276343222, 8049.1950804919625, 2106.3154474795715, 2241.1035585765744, 2322.7677232276806, 2325.3140323604493, 2332.055517515409, 2019.3538067818304, 2248.740705205082, 2287.2452090810075, 2296.242240060776, 2319.489712263299, 2315.641075633271, 2322.8025617822423, 2327.6857624220766, 2328.125858683759, 2330.778576035274, 2259.9209027684033, 2303.953920921589, 2305.262316058862, 2305.4005958450925, 2307.8846057697046, 2275.397019789757, 2291.6562515622622, 2293.6330187169974, 2300.7124109486313, 2301.5166814968875, 8618.741437756877, 8640.39517233794, 8729.34529910253, 8730.650773969033, 8755.299576033902, 5107.055194788976, 5276.736163191864, 5284.180951952453, 5285.101532739443, 5289.153735402318, 3037.6810434904237, 3432.5366075579727, 3541.1501239702543, 3637.018005138624, 3638.108663377463, 947.1712251779693, 1003.9096481316643, 1083.5232497701065, 1083.853679753239, 1086.0768346905147, 11457.713557161054, 11483.138764592606, 11502.769944601145, 11505.194636375374, 11513.963743263062, 4340.240457919851, 4522.638188944877, 4700.482946875841, 4722.268048452426, 4726.385569875894, 9696.17582505495, 9789.853152202722, 9802.705918822447, 9815.656452024145, 9837.065478779505, 5258.027264955996, 5266.262723218752, 5284.207368894697, 5296.285001524745, 5298.337707786527, 4688.0858232644305, 4775.808967641256, 4830.3479030331155, 4832.299316599074, 4833.685810422311, 3809.1810260794064, 3849.9615003850163, 3892.143728379752, 3923.47033150521, 3925.548561915359, 1110.8000559899297, 1244.2285782814713, 1254.3352023427415, 1260.5714057220405, 1275.7257189704258, 787.8857565653063, 846.1031306814796, 895.4285229422322, 925.6390007896925, 951.2390087929629, 5780.826575202751, 5794.101914203306, 5987.191729116601, 6103.725332360054, 6169.598976066542, 824.6041899888087, 896.7040876510736, 896.8699538566872, 911.886014248219, 932.2914584915513, 3907.6873850091924, 3982.203559288154, 4086.0602061526015, 4094.8566800161852, 4225.028243504012, 9590.280728945358, 10702.571897124184, 10705.197110216764, 10714.089302409227, 10730.78538429227, 10665.786684266272, 10686.305390149615, 10689.0, 10698.197635177392, 10700.678979630467, 7967.0, 8202.138775428613, 8203.384746144064, 8217.712380066549, 8226.670933162726, 5652.689102099424, 5870.823875283749, 6025.307089684742, 6045.335013148638, 6088.117223002729, 9660.71017869465, 9884.505774711091, 9958.0, 9980.650677226262, 9992.850107248252, 9599.568019439002, 9981.550830212804, 9994.150497207527, 10005.249606279413, 10201.693949181536, 6774.93225067743, 7022.473314501535, 7051.365377116084, 7106.147262328554, 7110.146782386147, 7695.461317707706, 7803.375729941477, 7985.0, 8098.473599216032, 8243.134470880472, 7254.093238345207, 7583.62081895892, 7715.691372345268, 7725.729599464216, 7727.613619319124, 7449.4412919032375, 7494.775156745306, 7497.512661676974, 7543.811404714706, 7547.433942454448, 6736.181231067682, 6888.621125838127, 6891.896621550581, 6902.275261097713, 6930.653467326512, 4524.095180963886, 5015.398152221756, 5149.588032957429, 5152.690838549699, 5235.81674641401, 4930.0, 5081.568066714371, 5126.589872810092, 5187.818426355059, 5299.6290259681455], "value": 4530.581141151103, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [290.3698973228096, 292.21831600468744, 302.62021163439874, 308.2248145913028, 308.54027499026455, 4971.9502804971935, 5065.949340506594, 5072.28987941688, 5072.365954255718, 5076.1370567003605, 4700.271457924018, 4895.853124406264, 4920.114379411713, 4941.60467162627, 5031.371078615173, 3802.182530755887, 3826.368649172883, 3834.7699138051667, 3854.7879866607327, 3863.942040869389, 3732.4774531565604, 3898.083950271684, 3905.6875449964077, 3955.5055618047745, 3965.0, 3812.0, 3814.2024123332517, 3863.4932376373235, 3921.8823435296986, 3936.2914675358566, 3544.5392099027217, 3544.8227588620725, 3884.184321292532, 3937.822797974098, 3942.4086387041884, 2860.599516067752, 3003.189138932476, 3289.342131573671, 3412.6246112927556, 3436.7489294512134, 4019.0, 4873.902521949542, 4916.827911023132, 4953.0, 5053.267276244961, 4135.276326642826, 4384.7369157850635, 4410.735355878657, 4460.643148548141, 4485.1254005468945, 4382.824687012516, 5289.942011597657, 5305.071612467803, 5308.867278318035, 5315.123004704219, 3768.8505005973166, 3774.3960966245268, 3782.9432558511644, 3786.9053273668105, 3794.886153415402, 4669.809198654321, 5314.5216930476445, 5517.393086760453, 5598.412166722476, 5635.887282254332, 3204.022773054194, 3283.9835800820842, 3719.5350581177354, 3786.8106594670157, 3794.753341032824, 3447.775894566845, 3862.4399462078404, 3873.69010479161, 3899.6212310490578, 3901.8244179012013, 3838.865639702597, 4230.667339787957, 4280.957190428056, 4487.304467807495, 4524.932126018112, 4481.619062379734, 5319.867003324948, 5322.520973112439, 5342.652727572696, 5419.864503387368, 1190.1668831817763, 1230.3786587773295, 1265.3293754310046, 1309.5547513845147, 1341.3025226881966, 830.7424698343533, 854.9868405938983, 857.7091477326708, 860.9225169734754, 866.5147517390282, 3910.452536644872, 4251.6598672106775, 4816.843957450186, 4876.439209490883, 5063.797448102035, 4499.615203941916, 5533.762748792002, 5556.944430555643, 5565.41563135873, 5647.802326918538, 4303.74177549348, 4621.23749581322, 4712.9057418851435, 4846.345743324677, 5086.872828179251, 2730.645016147888, 2751.9817667463167, 2840.1882136684944, 2868.4119755450083, 2916.83957382346, 5288.524032837063, 5651.858703532444, 5653.293338332708, 5659.179418984224, 5714.628549144292, 4524.819007239739, 5221.903400285906, 5259.8422047338645, 5332.240360680966, 5653.293338332708, 4823.397075365579, 5207.192885102815, 5234.246527413283, 5420.184238280221, 5654.349749778746, 5132.947745712195, 5477.698726570077, 5477.972610137083, 5520.68758744766, 5545.340075550118, 4579.404677392051, 5399.433059528693, 5407.864803379947, 5416.8645783854145, 5454.699991500505, 5644.8306550803545, 5681.488666020078, 5696.658200507983, 5753.1945527627, 5757.625754325955, 3175.6189257289275, 3186.980166346747, 3188.88838890647, 3202.4876019836715, 3364.697177253961, 4755.6208699476765, 5443.346798384219, 5473.863153421196, 5478.904618704643, 5515.558755299647, 4921.2864134700985, 5154.561862241751, 5294.682319060868, 5322.760475778677, 5383.1117865553315, 4459.862735002554, 4491.393661855738, 5029.622778291716, 5398.568114550905, 5428.945710542844, 4976.626752993612, 5228.085085110167, 5243.528082472596, 5254.868628284324, 5282.4717528246865, 4317.654587632919, 4435.645148388056, 4905.607551395951, 5254.97372513135, 5259.763310650953, 4817.421909370898, 5214.608904332266, 5239.318888544617, 5243.737813109253, 5247.291615631993], "value": 3888.3020893087837, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [610.6946526736632, 729.2270193594793, 731.4258307228827, 776.9883451748221, 804.6660635836126, 14878.10731356118, 15656.843431565681, 15657.451989180381, 15688.529344119695, 15714.0571565706, 13917.652058698537, 14031.859681403183, 14044.0, 14072.577822665311, 14079.084859484126, 653.3140202787079, 676.7665155521337, 677.2178134254943, 806.4516129032256, 816.5631387207845, 825.3438516379463, 826.5082276045744, 833.8874251975966, 838.5597561280316, 839.1273076000982, 883.2139395937621, 884.9823003539925, 885.5041176940933, 886.6586364249746, 888.3470649072926, 681.58082779091, 874.9475031498131, 875.52284005217, 875.7547886591765, 877.140402405646, 527.6280222443169, 528.0389690762813, 528.7118520406387, 529.5313647422021, 530.059145017593, 13765.38055787492, 14262.714745705029, 14359.78460323096, 14603.70792584153, 14618.0, 13882.4447022119, 14318.92840535801, 14595.78106328406, 14609.269536523132, 14618.561443156723, 11352.318860868374, 11699.766004679945, 11733.237339572986, 11774.587889423829, 12093.93953030238, 3720.609336019706, 3729.645683660075, 3751.174741556853, 3836.712246581518, 3870.148567315186, 104129.0, 106653.0, 108044.4597777014, 108747.91252087457, 108858.0, 10529.526171322308, 10715.678529644123, 10779.838302425469, 10792.136629069813, 10888.346699198073, 21055.578888422147, 21086.47283817917, 21095.789042109383, 21095.894520527607, 21097.894510527654, 7158.498905076594, 7519.699212031457, 7565.886511702329, 7741.303282704471, 7838.176991415933, 4297.140571885635, 4448.088141930896, 4471.6646251531265, 4494.595486406239, 4551.544845515422, 3437.1063523483576, 3584.426491761306, 3612.548431446069, 3612.837422316002, 3617.276544691072, 573.3922042634821, 665.0363831563837, 690.7168061095027, 693.8508220732567, 695.8956156576554, 528.4741682026331, 602.8462742000762, 606.2932844044002, 611.135243630267, 657.2868437745004, 8750.86873696895, 8916.777080572907, 9147.131022552847, 9518.571664275125, 10186.902838449689, 554.7864072332101, 557.946995035471, 641.0925409628308, 657.4575974820792, 665.3014334948285, 4156.459660244149, 4626.421697287839, 4643.976780116145, 4704.388429504143, 4760.857174284777, 87329.56335218283, 113689.0, 147357.0, 148767.0, 159659.0, 125747.74252257543, 128629.42741145125, 128743.0, 129124.0, 130196.0, 68001.0, 68920.0, 94134.0, 99593.0, 108389.0, 8497.405181637227, 8576.785580360542, 8901.73294801157, 9008.38266258793, 9018.368714190206, 60033.799324012405, 61013.779724404376, 61391.0, 62124.689376554634, 62476.19047619047, 88460.0, 91663.08336916546, 93763.0, 94780.0, 97547.0, 10934.453277335942, 11647.30116193031, 11836.408179591159, 11859.288442693465, 11998.700032499257, 12771.872281277068, 12822.487100516248, 12930.768848466552, 13308.134971226838, 13573.86426135726, 8454.957725211334, 11019.779604408028, 11025.503852326825, 11081.556737730723, 11386.089112871116, 11811.316451051342, 13180.143290686075, 13474.0, 13544.59366219015, 13628.70527299905, 13299.401526931118, 13308.534201302908, 13585.86414135846, 13648.522301719393, 13956.0, 10813.567457301935, 11026.282543536136, 11242.94378528102, 11327.943360283145, 11580.768384632092, 10451.268411211142, 11315.943420282845, 11471.082313415074, 11503.769924601294, 11590.362530060927], "value": 7480.178031609576, "unit": "score"}], "name": "dromaeo_css", "value": 7113.909259876356, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 115.0, 112.0, 113.0, 114.0, 114.0, 113.0, 111.0, 113.0, 113.0], "value": 113.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 116.0, 113.0, 150.0, 134.0, 137.0, 104.0, 132.0, 179.0, 139.0], "value": 135.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [185.0, 183.0, 185.0, 184.0, 184.0, 183.0, 184.0, 183.0, 181.0, 183.0], "value": 183.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 61.0, 75.0, 112.0, 84.0, 59.0, 59.0, 59.0, 84.0, 58.0], "value": 72.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 72.0, 96.0, 71.0, 68.0, 69.0, 93.0, 68.0, 69.0, 91.0], "value": 78.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 85.0, 89.0, 85.0, 89.0, 85.0, 88.0, 86.0, 89.0, 85.0], "value": 86.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 98.0, 98.0, 97.0, 97.0, 98.0, 97.0, 97.0, 97.0, 97.0], "value": 97.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 87.0, 91.0, 87.0, 88.0, 88.0, 90.0, 90.0, 89.0, 91.0], "value": 89.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 53.0, 53.0, 53.0, 55.0, 55.0, 56.0, 55.0, 56.0, 54.0], "value": 54.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 72.0, 71.0, 70.0, 75.0, 76.0, 72.0, 71.0, 71.0, 75.0], "value": 71.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 90.0, 96.0, 87.0, 87.0, 87.0, 87.0, 90.0, 90.0, 93.0], "value": 89.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 159.0, 144.0, 137.0, 157.0, 146.0, 147.0, 133.0, 180.0, 162.0], "value": 151.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 173.0, 171.0, 168.0, 171.0, 177.0, 234.0, 172.0, 169.0, 170.0], "value": 177.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 70.0, 69.0, 68.0, 68.0, 69.0, 68.0, 69.0, 68.0, 69.0], "value": 68.7, "unit": "score"}], "name": "kraken", "value": 1470.4999999999998, "alertThreshold": 2.0}]} 12:48:58 INFO - Return code: 0 12:48:58 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 12:48:58 INFO - # TBPL SUCCESS # 12:48:58 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 12:48:58 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 12:48:58 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 12:48:58 INFO - 2016-10-11 12:48:58.903 screenresolution[1958:22134] starting screenresolution argv=screenresolution get 12:48:58 INFO - 2016-10-11 12:48:58.905 screenresolution[1958:22134] Display 0: 1600x1200x32@60 12:48:58 INFO - 2016-10-11 12:48:58.912 screenresolution[1959:22137] starting screenresolution argv=screenresolution list 12:48:58 INFO - Available Modes on Display 0 12:48:58 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 12:48:58 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 12:48:58 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 12:48:58 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 12:48:59 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 12:48:59 INFO - Intel Iris: 12:48:59 INFO - Chipset Model: Intel Iris 12:48:59 INFO - Type: GPU 12:48:59 INFO - Bus: Built-In 12:48:59 INFO - VRAM (Dynamic, Max): 1536 MB 12:48:59 INFO - Vendor: Intel (0x8086) 12:48:59 INFO - Device ID: 0x0a2e 12:48:59 INFO - Revision ID: 0x0009 12:48:59 INFO - Displays: 12:48:59 INFO - Display: 12:48:59 INFO - Resolution: 1600 x 1200 @ 60 Hz 12:48:59 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 12:48:59 INFO - Display Serial Number: 1600x1200 60 12:48:59 INFO - Main Display: Yes 12:48:59 INFO - Mirror: Off 12:48:59 INFO - Online: Yes 12:48:59 INFO - Rotation: Supported 12:48:59 INFO - Return code: 0 12:48:59 INFO - Running post-action listener: _resource_record_post_action 12:48:59 INFO - [mozharness: 2016-10-11 19:48:59.154076Z] Finished run-tests step (success) 12:48:59 INFO - Running post-run listener: _resource_record_post_run 12:48:59 INFO - Total resource usage - Wall time: 1214s; CPU: 54.0%; Read bytes: 36864; Write bytes: 708564992; Read time: 1; Write time: 1982 12:48:59 INFO - TinderboxPrint: CPU usage
53.6% 12:48:59 INFO - TinderboxPrint: I/O read bytes / time
36,864 / 1 12:48:59 INFO - TinderboxPrint: I/O write bytes / time
708,564,992 / 1,982 12:48:59 INFO - TinderboxPrint: CPU idle
2,254.5 (46.4%) 12:48:59 INFO - TinderboxPrint: CPU system
975.5 (20.1%) 12:48:59 INFO - TinderboxPrint: CPU user
1,627.7 (33.5%) 12:48:59 INFO - TinderboxPrint: Swap in / out
406,421,504 / 0 12:48:59 INFO - install - Wall time: 35s; CPU: 54.0%; Read bytes: 388766208; Write bytes: 383325696; Read time: 29357; Write time: 790 12:48:59 INFO - run-tests - Wall time: 1180s; CPU: 54.0%; Read bytes: 36864; Write bytes: 298676736; Read time: 1; Write time: 1123 12:48:59 INFO - Running post-run listener: _upload_blobber_files 12:48:59 INFO - Blob upload gear active. 12:48:59 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:48:59 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 12:48:59 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', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 12:48:59 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 Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 12:49:00 INFO - (blobuploader) - INFO - Open directory for files ... 12:49:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 12:49:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:49:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:49:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 12:49:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:49:01 INFO - (blobuploader) - INFO - Done attempting. 12:49:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 12:49:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:49:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:49:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 12:49:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:49:01 INFO - (blobuploader) - INFO - Done attempting. 12:49:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 12:49:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:49:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:49:04 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 12:49:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:49:04 INFO - (blobuploader) - INFO - Done attempting. 12:49:04 INFO - (blobuploader) - INFO - Iteration through files over. 12:49:04 INFO - Return code: 0 12:49:04 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:49:04 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:49:04 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/31b5dbf26758353395e95309c93d4d4d02ec2cb78bd959da933a77166ee8ddf05246a9703d2bca32f8ec8a88990baf7ec1b0f186932ba7e3afecf1c19edeaa44", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/182414a014b24bd62c38f67532a10b2868f7c9388789f6f68b62436cf4bf1d66602124c6552d839a415ce76af618beac1d2f424d57d6fc331fc2556d945c1f91", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/74867be524093f8e790a7931d848f28d1b4bb6a2d631aff91595aecf3e2c024f74f1e41ae1e3d565e91b4064cb8dc23c725e8eb0be19bd8d02e33516294537b3"} 12:49:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:49:04 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:49:04 INFO - Contents: 12:49:04 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/31b5dbf26758353395e95309c93d4d4d02ec2cb78bd959da933a77166ee8ddf05246a9703d2bca32f8ec8a88990baf7ec1b0f186932ba7e3afecf1c19edeaa44", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/182414a014b24bd62c38f67532a10b2868f7c9388789f6f68b62436cf4bf1d66602124c6552d839a415ce76af618beac1d2f424d57d6fc331fc2556d945c1f91", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/74867be524093f8e790a7931d848f28d1b4bb6a2d631aff91595aecf3e2c024f74f1e41ae1e3d565e91b4064cb8dc23c725e8eb0be19bd8d02e33516294537b3"} 12:49:04 INFO - Running post-run listener: copy_logs_to_upload_dir 12:49:04 INFO - Copying logs to upload dir... 12:49:04 INFO - mkdir: /builds/slave/test/build/upload/logs 12:49:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1274.725810 ========= master_lag: 0.06 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 14 secs) (at 2016-10-11 12:49:04.544859) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-11 12:49:04.552019) ========= 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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners TMPDIR=/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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/Fx-Team/sha512/31b5dbf26758353395e95309c93d4d4d02ec2cb78bd959da933a77166ee8ddf05246a9703d2bca32f8ec8a88990baf7ec1b0f186932ba7e3afecf1c19edeaa44", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/182414a014b24bd62c38f67532a10b2868f7c9388789f6f68b62436cf4bf1d66602124c6552d839a415ce76af618beac1d2f424d57d6fc331fc2556d945c1f91", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/74867be524093f8e790a7931d848f28d1b4bb6a2d631aff91595aecf3e2c024f74f1e41ae1e3d565e91b4064cb8dc23c725e8eb0be19bd8d02e33516294537b3"} build_url:https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010944 build_url: 'https://queue.taskcluster.net/v1/task/eCSmKBaKS2yvdQuVbe3rzw/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/31b5dbf26758353395e95309c93d4d4d02ec2cb78bd959da933a77166ee8ddf05246a9703d2bca32f8ec8a88990baf7ec1b0f186932ba7e3afecf1c19edeaa44", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/182414a014b24bd62c38f67532a10b2868f7c9388789f6f68b62436cf4bf1d66602124c6552d839a415ce76af618beac1d2f424d57d6fc331fc2556d945c1f91", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/74867be524093f8e790a7931d848f28d1b4bb6a2d631aff91595aecf3e2c024f74f1e41ae1e3d565e91b4064cb8dc23c725e8eb0be19bd8d02e33516294537b3"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-11 12:49:04.586977) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 12:49:04.587327) ========= 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.fKfgmXnDs0/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.EKNMRSkmLu/Listeners TMPDIR=/var/folders/fh/x511n7yj7hb7h81n2245hgqc00000w/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.005295 ========= master_lag: 0.06 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 12:49:04.654490) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-11 12:49:04.654824) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-11 12:49:04.655150) ========= ========= Total master_lag: 0.22 =========