builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0117 starttime: 1477009552.08 results: success (0) buildid: 20161020151049 builduid: b8028351dc2541559ee0596912bcf654 revision: ba6fc133264d8e7aa8adf43d9d88f48b6dc2ffac ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:52.076194) ========= master: http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:52.076719) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:52.077072) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:52.100301) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:52.100718) ========= 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.MGFVOrzDfi/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.ifB5XESfyM/Listeners TMPDIR=/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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-20 17:25:52-- 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% 8.26M=0.001s 2016-10-20 17:25:52 (8.26 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.139079 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:52.261920) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:52.262277) ========= 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.MGFVOrzDfi/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.ifB5XESfyM/Listeners TMPDIR=/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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.019579 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:52.311114) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-20 17:25:52.311512) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev ba6fc133264d8e7aa8adf43d9d88f48b6dc2ffac --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 ba6fc133264d8e7aa8adf43d9d88f48b6dc2ffac --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.MGFVOrzDfi/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.ifB5XESfyM/Listeners TMPDIR=/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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-20 17:25:52,384 truncating revision to first 12 chars 2016-10-20 17:25:52,384 Setting DEBUG logging. 2016-10-20 17:25:52,384 attempt 1/10 2016-10-20 17:25:52,384 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ba6fc133264d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-20 17:25:53,790 unpacking tar archive at: fx-team-ba6fc133264d/testing/mozharness/ program finished with exit code 0 elapsedTime=1.678874 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-20 17:25:54.015362) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:54.016040) ========= script_repo_revision: ba6fc133264d8e7aa8adf43d9d88f48b6dc2ffac ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:54.016806) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:54.017443) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-20 17:25:54.037929) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 20 secs) (at 2016-10-20 17:25:54.038611) ========= /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.MGFVOrzDfi/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.ifB5XESfyM/Listeners TMPDIR=/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:25:54 INFO - MultiFileLogger online at 20161020 17:25:54 in /builds/slave/test 17:25:54 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 17:25:54 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:25:54 INFO - {'append_to_log': False, 17:25:54 INFO - 'base_work_dir': '/builds/slave/test', 17:25:54 INFO - 'blob_upload_branch': 'Fx-Team', 17:25:54 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:25:54 INFO - 'branch': 'Fx-Team', 17:25:54 INFO - 'buildbot_json_path': 'buildprops.json', 17:25:54 INFO - 'config_files': ('talos/mac_config.py',), 17:25:54 INFO - 'default_actions': ('clobber', 17:25:54 INFO - 'read-buildbot-config', 17:25:54 INFO - 'download-and-extract', 17:25:54 INFO - 'populate-webroot', 17:25:54 INFO - 'create-virtualenv', 17:25:54 INFO - 'install', 17:25:54 INFO - 'run-tests'), 17:25:54 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:25:54 INFO - 'download_minidump_stackwalk': True, 17:25:54 INFO - 'download_symbols': 'ondemand', 17:25:54 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:25:54 INFO - 'tooltool.py': '/tools/tooltool.py', 17:25:54 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:25:54 INFO - '/tools/misc-python/virtualenv.py')}, 17:25:54 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:25:54 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:25:54 INFO - 'installer_path': 'installer.exe', 17:25:54 INFO - 'log_level': 'info', 17:25:54 INFO - 'log_name': 'talos', 17:25:54 INFO - 'log_to_console': True, 17:25:54 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 17:25:54 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 17:25:54 INFO - 'opt_config_files': (), 17:25:54 INFO - 'pip_index': False, 17:25:54 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:25:54 INFO - 'cmd': ('bash', 17:25:54 INFO - '-c', 17:25:54 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:25:54 INFO - 'enabled': True, 17:25:54 INFO - 'halt_on_failure': False, 17:25:54 INFO - 'name': 'check_screen_resolution'},), 17:25:54 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:25:54 INFO - 'cmd': ('bash', 17:25:54 INFO - '-c', 17:25:54 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:25:54 INFO - 'enabled': True, 17:25:54 INFO - 'halt_on_failure': False, 17:25:54 INFO - 'name': 'check_screen_resolution'},), 17:25:54 INFO - 'run_cmd_checks_enabled': True, 17:25:54 INFO - 'sps_profile': False, 17:25:54 INFO - 'sps_profile_interval': 0, 17:25:54 INFO - 'suite': 'dromaeojs', 17:25:54 INFO - 'system_bits': '32', 17:25:54 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:25:54 INFO - 'title': 't-yosemite-r7-0117', 17:25:54 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:25:54 INFO - 'use_talos_json': True, 17:25:54 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:25:54 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:25:54 INFO - 'work_dir': 'build'} 17:25:54 INFO - [mozharness: 2016-10-21 00:25:54.240013Z] Running clobber step. 17:25:54 INFO - Running pre-action listener: _resource_record_pre_action 17:25:54 INFO - Running main action method: clobber 17:25:54 INFO - rmtree: /builds/slave/test/build 17:25:54 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:25:55 INFO - Running post-action listener: _resource_record_post_action 17:25:55 INFO - [mozharness: 2016-10-21 00:25:55.155951Z] Finished clobber step (success) 17:25:55 INFO - [mozharness: 2016-10-21 00:25:55.156026Z] Running read-buildbot-config step. 17:25:55 INFO - Running pre-action listener: _resource_record_pre_action 17:25:55 INFO - Running main action method: read_buildbot_config 17:25:55 INFO - Using buildbot properties: 17:25:55 INFO - { 17:25:55 INFO - "project": "", 17:25:55 INFO - "product": "firefox", 17:25:55 INFO - "script_repo_revision": "production", 17:25:55 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 17:25:55 INFO - "repository": "", 17:25:55 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 17:25:55 INFO - "buildid": "20161020151049", 17:25:55 INFO - "pgo_build": "False", 17:25:55 INFO - "basedir": "/builds/slave/test", 17:25:55 INFO - "buildnumber": 22, 17:25:55 INFO - "slavename": "t-yosemite-r7-0117", 17:25:55 INFO - "master": "http://buildbot-master135.bb.releng.scl3.mozilla.com:8201/", 17:25:55 INFO - "platform": "yosemite_r7", 17:25:55 INFO - "scheduler": "tests-fx-team-macosx64-talos", 17:25:55 INFO - "branch": "fx-team", 17:25:55 INFO - "repo_path": "integration/fx-team", 17:25:55 INFO - "revision": "ba6fc133264d8e7aa8adf43d9d88f48b6dc2ffac", 17:25:55 INFO - "stage_platform": "macosx64", 17:25:55 INFO - "builduid": "b8028351dc2541559ee0596912bcf654", 17:25:55 INFO - "slavebuilddir": "test" 17:25:55 INFO - } 17:25:55 INFO - Found installer url https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg. 17:25:55 INFO - Running post-action listener: _resource_record_post_action 17:25:55 INFO - [mozharness: 2016-10-21 00:25:55.159464Z] Finished read-buildbot-config step (success) 17:25:55 INFO - [mozharness: 2016-10-21 00:25:55.159579Z] Running download-and-extract step. 17:25:55 INFO - Running pre-action listener: _resource_record_pre_action 17:25:55 INFO - Running main action method: download_and_extract 17:25:55 INFO - mkdir: /builds/slave/test/build/tests 17:25:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:25:55 INFO - trying https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json 17:25:55 INFO - Downloading https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/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 17:25:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/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 17:25:56 INFO - Downloaded 1199 bytes. 17:25:56 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 17:25:56 INFO - Using the following test package requirements: 17:25:56 INFO - {u'common': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 17:25:56 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 17:25:56 INFO - u'firefox-52.0a1.en-US.mac.cppunittest.tests.zip'], 17:25:56 INFO - u'gtest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 17:25:56 INFO - u'firefox-52.0a1.en-US.mac.gtest.tests.zip'], 17:25:56 INFO - u'jittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 17:25:56 INFO - u'jsshell-mac.zip'], 17:25:56 INFO - u'mochitest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 17:25:56 INFO - u'firefox-52.0a1.en-US.mac.mochitest.tests.zip'], 17:25:56 INFO - u'mozbase': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 17:25:56 INFO - u'reftest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 17:25:56 INFO - u'firefox-52.0a1.en-US.mac.reftest.tests.zip'], 17:25:56 INFO - u'talos': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 17:25:56 INFO - u'firefox-52.0a1.en-US.mac.talos.tests.zip'], 17:25:56 INFO - u'web-platform': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 17:25:56 INFO - u'firefox-52.0a1.en-US.mac.web-platform.tests.zip'], 17:25:56 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 17:25:56 INFO - u'firefox-52.0a1.en-US.mac.xpcshell.tests.zip']} 17:25:56 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip'] for test suite category: common 17:25:56 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 17:25:56 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 17:25:56 INFO - Fetch https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 17:25:57 INFO - Http code: 200 17:25:57 INFO - via: 1.1 5c2ff4ca1e447265402af29264e83497.cloudfront.net (CloudFront) 17:25:57 INFO - x-amz-cf-id: YTbKubLoyv-ZibyuReWnx4LuwKqQbtgwJR1Q-ymk8gtcGdjTi2wBcQ== 17:25:57 INFO - x-amz-version-id: yF9O5GlwLjnki_wwbVaz7oGs6fMfrfyz 17:25:58 INFO - Expected file size: 16507025 17:25:58 INFO - Obtained file size: 16507025 17:26:05 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 17:26:05 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 17:26:05 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 17:26:05 INFO - Fetch https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 17:26:06 INFO - Http code: 200 17:26:06 INFO - via: 1.1 e2af8a85927835558866752f53562ecd.cloudfront.net (CloudFront) 17:26:06 INFO - x-amz-cf-id: zjfk9ZfiABDOLWz4M7yu2XOO6w6INYrAyx7Sc34Wrji7Uu6FM6EXug== 17:26:06 INFO - x-amz-version-id: yF9O5GlwLjnki_wwbVaz7oGs6fMfrfyz 17:26:06 INFO - Expected file size: 16507025 17:26:06 INFO - Obtained file size: 16507025 17:26:13 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip 17:26:13 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip'}, attempt #1 17:26:13 INFO - Fetch https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip into memory 17:26:13 INFO - Http code: 200 17:26:13 INFO - via: 1.1 d2bd759914e30b1d5aee2929535c55f9.cloudfront.net (CloudFront) 17:26:13 INFO - x-amz-cf-id: 5rNRu8mAlRlPUjME1H45r6AlbsNzab6hc2CGC3HI3eqC0JR0ToCjLQ== 17:26:13 INFO - x-amz-version-id: cIqtuW_Hx_RpUIN30rbv7dmtA_svwMEY 17:26:14 INFO - Expected file size: 14409028 17:26:14 INFO - Obtained file size: 14409028 17:26:14 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')]} 17:26:14 INFO - trying https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 17:26:14 INFO - Downloading https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg 17:26:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/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 17:26:18 INFO - Downloaded 111629040 bytes. 17:26:18 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 17:26:18 INFO - mkdir: /builds/slave/test/properties 17:26:18 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:26:18 INFO - Writing to file /builds/slave/test/properties/build_url 17:26:18 INFO - Contents: 17:26:18 INFO - build_url:https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 17:26:19 INFO - Running post-action listener: _resource_record_post_action 17:26:19 INFO - Running post-action listener: set_extra_try_arguments 17:26:19 INFO - [mozharness: 2016-10-21 00:26:19.817343Z] Finished download-and-extract step (success) 17:26:19 INFO - [mozharness: 2016-10-21 00:26:19.817487Z] Running populate-webroot step. 17:26:19 INFO - Running pre-action listener: _resource_record_pre_action 17:26:19 INFO - Running main action method: populate_webroot 17:26:19 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:26:19 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:26:19 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:26:19 INFO - '--tppagecycles', 17:26:19 INFO - '7'], 17:26:19 INFO - 'tests': ['tsvgm']}}, 17:26:19 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:26:19 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 17:26:19 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:26:19 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 17:26:19 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:26:19 INFO - 'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:26:19 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:26:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:26:19 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:26:19 INFO - 'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['damp', 'tps']}, 17:26:19 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:26:19 INFO - 'tests': ['damp', 'tps']}, 17:26:19 INFO - 'g3': {'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['dromaeo_dom']}, 17:26:19 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:26:19 INFO - 'g4': {'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['basic_compositor_video']}, 17:26:19 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 17:26:19 INFO - 'other': {'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['a11yr', 17:26:19 INFO - 'ts_paint', 17:26:19 INFO - 'tpaint', 17:26:19 INFO - 'sessionrestore', 17:26:19 INFO - 'sessionrestore_no_auto_restore', 17:26:19 INFO - 'tabpaint']}, 17:26:19 INFO - 'other-e10s': {'tests': ['a11yr', 17:26:19 INFO - 'ts_paint', 17:26:19 INFO - 'tpaint', 17:26:19 INFO - 'sessionrestore', 17:26:19 INFO - 'sessionrestore_no_auto_restore', 17:26:19 INFO - 'tabpaint']}, 17:26:19 INFO - 'other-e10s_l64': {'tests': ['a11yr', 17:26:19 INFO - 'ts_paint', 17:26:19 INFO - 'tpaint', 17:26:19 INFO - 'sessionrestore', 17:26:19 INFO - 'sessionrestore_no_auto_restore', 17:26:19 INFO - 'tabpaint']}, 17:26:19 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 17:26:19 INFO - 'ts_paint', 17:26:19 INFO - 'tpaint', 17:26:19 INFO - 'sessionrestore', 17:26:19 INFO - 'sessionrestore_no_auto_restore', 17:26:19 INFO - 'tabpaint']}, 17:26:19 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['a11yr', 17:26:19 INFO - 'ts_paint', 17:26:19 INFO - 'tpaint', 17:26:19 INFO - 'sessionrestore', 17:26:19 INFO - 'sessionrestore_no_auto_restore', 17:26:19 INFO - 'tabpaint']}, 17:26:19 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['a11yr', 17:26:19 INFO - 'ts_paint', 17:26:19 INFO - 'tpaint', 17:26:19 INFO - 'sessionrestore', 17:26:19 INFO - 'sessionrestore_no_auto_restore', 17:26:19 INFO - 'tabpaint']}, 17:26:19 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['tsvgx', 17:26:19 INFO - 'tsvgr_opacity', 17:26:19 INFO - 'tart', 17:26:19 INFO - 'tscrollx', 17:26:19 INFO - 'cart']}, 17:26:19 INFO - 'svgr-e10s': {'tests': ['tsvgx', 17:26:19 INFO - 'tsvgr_opacity', 17:26:19 INFO - 'tart', 17:26:19 INFO - 'tscrollx', 17:26:19 INFO - 'cart']}, 17:26:19 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:26:19 INFO - 'talos_options': ['--disable-e10s'], 17:26:19 INFO - 'tests': ['tp5o']}, 17:26:19 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:26:19 INFO - 'tests': ['tp5o']}, 17:26:19 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:26:19 INFO - 'talos_options': ['--disable-e10s', 17:26:19 INFO - '--xperf_path', 17:26:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:26:19 INFO - 'tests': ['tp5n']}, 17:26:19 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:26:19 INFO - 'talos_options': ['--xperf_path', 17:26:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:26:19 INFO - 'tests': ['tp5n']}}, 17:26:19 INFO - 'talos.zip': {'path': '', 17:26:19 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:26:19 INFO - Running post-action listener: _resource_record_post_action 17:26:19 INFO - [mozharness: 2016-10-21 00:26:19.836922Z] Finished populate-webroot step (success) 17:26:19 INFO - [mozharness: 2016-10-21 00:26:19.837041Z] Running create-virtualenv step. 17:26:19 INFO - Running pre-action listener: _resource_record_pre_action 17:26:19 INFO - Running main action method: create_virtualenv 17:26:19 INFO - Creating virtualenv /builds/slave/test/build/venv 17:26:19 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 17:26:19 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:26:19 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:26:19 INFO - Using real prefix '/tools/python27' 17:26:19 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:26:20 INFO - Installing distribute.............................................................................................................................................................................................done. 17:26:23 INFO - Installing pip.................done. 17:26:23 INFO - Return code: 0 17:26:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 17:26:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 17:26:23 INFO - Reading from file tmpfile_stdout 17:26:23 INFO - Output received: 17:26:23 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) 17:26:23 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:26:23 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')]} 17:26:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:23 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')]} 17:26:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:23 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 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:23 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 17:26:23 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 17:26:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:23 INFO - 'HOME': '/Users/cltbld', 17:26:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:23 INFO - 'LOGNAME': 'cltbld', 17:26:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:23 INFO - 'MOZ_NO_REMOTE': '1', 17:26:23 INFO - 'NO_EM_RESTART': '1', 17:26:23 INFO - 'PAGER': '/bin/cat', 17:26:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:23 INFO - 'PWD': '/builds/slave/test', 17:26:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:23 INFO - 'SHELL': '/bin/bash', 17:26:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:23 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:23 INFO - 'USER': 'cltbld', 17:26:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:23 INFO - 'XPC_FLAGS': '0x0', 17:26:23 INFO - 'XPC_SERVICE_NAME': '0', 17:26:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:23 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 17:26:23 INFO - Cleaning up... 17:26:24 INFO - Return code: 0 17:26:24 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 17:26:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:24 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 17:26:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 17:26:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:24 INFO - 'HOME': '/Users/cltbld', 17:26:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:24 INFO - 'LOGNAME': 'cltbld', 17:26:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:24 INFO - 'MOZ_NO_REMOTE': '1', 17:26:24 INFO - 'NO_EM_RESTART': '1', 17:26:24 INFO - 'PAGER': '/bin/cat', 17:26:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:24 INFO - 'PWD': '/builds/slave/test', 17:26:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:24 INFO - 'SHELL': '/bin/bash', 17:26:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:24 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:24 INFO - 'USER': 'cltbld', 17:26:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:24 INFO - 'XPC_FLAGS': '0x0', 17:26:24 INFO - 'XPC_SERVICE_NAME': '0', 17:26:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:24 INFO - Downloading/unpacking psutil>=3.1.1 17:26:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:26:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:26:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:26:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:26:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:26:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:26:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:26:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:26:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:26:27 INFO - Installing collected packages: psutil 17:26:27 INFO - Running setup.py install for psutil 17:26:27 INFO - building 'psutil._psutil_osx' extension 17:26:27 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 17:26:28 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 17:26:28 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 17:26:28 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 17:26:28 INFO - building 'psutil._psutil_posix' extension 17:26:28 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 17:26:28 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 17:26:28 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 17:26:28 INFO - ^ 17:26:28 INFO - 1 warning generated. 17:26:28 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 17:26:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:26:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:26:28 INFO - Successfully installed psutil 17:26:28 INFO - Cleaning up... 17:26:28 INFO - Return code: 0 17:26:28 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 17:26: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')]} 17:26:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26: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')]} 17:26:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 17:26: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 mozsystemmonitor==0.3 17:26:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:28 INFO - 'HOME': '/Users/cltbld', 17:26:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:28 INFO - 'LOGNAME': 'cltbld', 17:26:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:28 INFO - 'MOZ_NO_REMOTE': '1', 17:26:28 INFO - 'NO_EM_RESTART': '1', 17:26:28 INFO - 'PAGER': '/bin/cat', 17:26:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:28 INFO - 'PWD': '/builds/slave/test', 17:26:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:28 INFO - 'SHELL': '/bin/bash', 17:26:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:28 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:28 INFO - 'USER': 'cltbld', 17:26:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:28 INFO - 'XPC_FLAGS': '0x0', 17:26:28 INFO - 'XPC_SERVICE_NAME': '0', 17:26:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:28 INFO - Downloading/unpacking mozsystemmonitor==0.3 17:26:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:26:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:26:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:26:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:26:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:26:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:26:31 INFO - Downloading mozsystemmonitor-0.3.tar.gz 17:26:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:26:31 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 17:26:31 INFO - Installing collected packages: mozsystemmonitor 17:26:31 INFO - Running setup.py install for mozsystemmonitor 17:26:31 INFO - Successfully installed mozsystemmonitor 17:26:31 INFO - Cleaning up... 17:26:31 INFO - Return code: 0 17:26:31 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 17:26:31 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')]} 17:26:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:31 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')]} 17:26:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:31 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 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:31 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 17:26:31 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 17:26:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:31 INFO - 'HOME': '/Users/cltbld', 17:26:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:31 INFO - 'LOGNAME': 'cltbld', 17:26:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:31 INFO - 'MOZ_NO_REMOTE': '1', 17:26:31 INFO - 'NO_EM_RESTART': '1', 17:26:31 INFO - 'PAGER': '/bin/cat', 17:26:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:31 INFO - 'PWD': '/builds/slave/test', 17:26:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:31 INFO - 'SHELL': '/bin/bash', 17:26:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:31 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:31 INFO - 'USER': 'cltbld', 17:26:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:31 INFO - 'XPC_FLAGS': '0x0', 17:26:31 INFO - 'XPC_SERVICE_NAME': '0', 17:26:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:31 INFO - Downloading/unpacking jsonschema==2.5.1 17:26: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 17:26: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 17:26: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 17:26: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 17:26: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 17:26: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 17:26:34 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:26:34 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 17:26:34 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 17:26:34 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 17:26:34 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 17:26:34 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 17:26:34 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 17:26:34 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 17:26:34 INFO - Downloading functools32-3.2.3-2.tar.gz 17:26:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:26:34 INFO - warning: no files found matching '*.txt' 17:26:34 INFO - no previously-included directories found matching 'build' 17:26:34 INFO - no previously-included directories found matching 'dist' 17:26:34 INFO - no previously-included directories found matching '.git*' 17:26:34 INFO - Installing collected packages: jsonschema, functools32 17:26:34 INFO - Running setup.py install for functools32 17:26:35 INFO - warning: no files found matching '*.txt' 17:26:35 INFO - no previously-included directories found matching 'build' 17:26:35 INFO - no previously-included directories found matching 'dist' 17:26:35 INFO - no previously-included directories found matching '.git*' 17:26:35 INFO - Successfully installed jsonschema functools32 17:26:35 INFO - Cleaning up... 17:26:35 INFO - Return code: 0 17:26:35 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 17:26:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:35 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 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:35 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 17:26:35 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 17:26:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:35 INFO - 'HOME': '/Users/cltbld', 17:26:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:35 INFO - 'LOGNAME': 'cltbld', 17:26:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:35 INFO - 'MOZ_NO_REMOTE': '1', 17:26:35 INFO - 'NO_EM_RESTART': '1', 17:26:35 INFO - 'PAGER': '/bin/cat', 17:26:35 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:35 INFO - 'PWD': '/builds/slave/test', 17:26:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:35 INFO - 'SHELL': '/bin/bash', 17:26:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:35 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:35 INFO - 'USER': 'cltbld', 17:26:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:35 INFO - 'XPC_FLAGS': '0x0', 17:26:35 INFO - 'XPC_SERVICE_NAME': '0', 17:26:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:35 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 17:26:35 INFO - Cleaning up... 17:26:35 INFO - Return code: 0 17:26:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:26:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:35 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 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:35 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 17:26:35 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 17:26:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:35 INFO - 'HOME': '/Users/cltbld', 17:26:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:35 INFO - 'LOGNAME': 'cltbld', 17:26:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:35 INFO - 'MOZ_NO_REMOTE': '1', 17:26:35 INFO - 'NO_EM_RESTART': '1', 17:26:35 INFO - 'PAGER': '/bin/cat', 17:26:35 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:35 INFO - 'PWD': '/builds/slave/test', 17:26:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:35 INFO - 'SHELL': '/bin/bash', 17:26:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:35 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:35 INFO - 'USER': 'cltbld', 17:26:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:35 INFO - 'XPC_FLAGS': '0x0', 17:26:35 INFO - 'XPC_SERVICE_NAME': '0', 17:26:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:35 INFO - Downloading/unpacking blobuploader==1.2.4 17:26:35 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 17:26:35 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 17:26:35 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 17:26:35 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 17:26:35 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 17:26:35 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 17:26:38 INFO - Downloading blobuploader-1.2.4.tar.gz 17:26:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:26:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:26:38 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 17:26:38 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 17:26:38 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 17:26:38 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 17:26:38 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 17:26:38 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 17:26:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:26:38 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:26:38 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 17:26:38 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 17:26:38 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 17:26:38 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 17:26:38 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 17:26:38 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 17:26:39 INFO - Downloading docopt-0.6.1.tar.gz 17:26:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:26:39 INFO - Installing collected packages: blobuploader, requests, docopt 17:26:39 INFO - Running setup.py install for blobuploader 17:26:39 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:26:39 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:26:39 INFO - Running setup.py install for requests 17:26:40 INFO - Running setup.py install for docopt 17:26:40 INFO - Successfully installed blobuploader requests docopt 17:26:40 INFO - Cleaning up... 17:26:40 INFO - Return code: 0 17:26:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:26:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:40 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 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:40 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 17:26:40 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 17:26:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:40 INFO - 'HOME': '/Users/cltbld', 17:26:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:40 INFO - 'LOGNAME': 'cltbld', 17:26:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:40 INFO - 'MOZ_NO_REMOTE': '1', 17:26:40 INFO - 'NO_EM_RESTART': '1', 17:26:40 INFO - 'PAGER': '/bin/cat', 17:26:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:40 INFO - 'PWD': '/builds/slave/test', 17:26:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:40 INFO - 'SHELL': '/bin/bash', 17:26:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:40 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:40 INFO - 'USER': 'cltbld', 17:26:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:40 INFO - 'XPC_FLAGS': '0x0', 17:26:40 INFO - 'XPC_SERVICE_NAME': '0', 17:26:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:26:40 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-nMexmv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:26:40 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-27e2S4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:26:40 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-5YAqrv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:26:40 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-hgpmea-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:26:40 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-tMtWTV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-REvC5j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-iZSWRn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-MDYdbo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-_lo4G8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-W6PBPQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-2G1592-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-oruBoC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-y2MDKW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-rJPDW6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:26:41 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-WGSUev-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:26:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:26:42 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-8rZ6Rm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:26:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:26:42 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-gJfNl1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:26:42 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:26:42 INFO - Running setup.py install for manifestparser 17:26:42 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:26:42 INFO - Running setup.py install for mozcrash 17:26:42 INFO - Running setup.py install for mozdebug 17:26:42 INFO - Running setup.py install for mozdevice 17:26:42 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 17:26:42 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:26:42 INFO - Running setup.py install for mozfile 17:26:43 INFO - Running setup.py install for mozhttpd 17:26:43 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:26:43 INFO - Running setup.py install for mozinfo 17:26:43 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:26:43 INFO - Running setup.py install for mozInstall 17:26:43 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:26:43 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:26:43 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:26:43 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:26:43 INFO - Running setup.py install for mozleak 17:26:43 INFO - Running setup.py install for mozlog 17:26:43 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:26:43 INFO - Running setup.py install for moznetwork 17:26:43 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:26:43 INFO - Running setup.py install for mozprocess 17:26:44 INFO - Running setup.py install for mozprofile 17:26:44 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:26:44 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:26:44 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:26:44 INFO - Running setup.py install for mozrunner 17:26:44 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:26:44 INFO - Running setup.py install for mozscreenshot 17:26:44 INFO - Running setup.py install for moztest 17:26:44 INFO - Running setup.py install for mozversion 17:26:44 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:26:44 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:26:44 INFO - Cleaning up... 17:26:44 INFO - Return code: 0 17:26:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:26: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')]} 17:26:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26: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')]} 17:26:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:44 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 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:44 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 17:26:44 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 17:26:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:44 INFO - 'HOME': '/Users/cltbld', 17:26:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:44 INFO - 'LOGNAME': 'cltbld', 17:26:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:44 INFO - 'MOZ_NO_REMOTE': '1', 17:26:44 INFO - 'NO_EM_RESTART': '1', 17:26:44 INFO - 'PAGER': '/bin/cat', 17:26:44 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:44 INFO - 'PWD': '/builds/slave/test', 17:26:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:44 INFO - 'SHELL': '/bin/bash', 17:26:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:44 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:44 INFO - 'USER': 'cltbld', 17:26:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:44 INFO - 'XPC_FLAGS': '0x0', 17:26:44 INFO - 'XPC_SERVICE_NAME': '0', 17:26:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:26:45 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-TiFeoH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:26:45 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)) 17:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:26:45 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-7Z21kR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:26:45 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)) 17:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:26:45 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-yGbOv0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:26:45 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)) 17:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:26:45 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-smMXKC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:26:45 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)) 17:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:26:45 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-JGpufW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:26:45 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)) 17:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:26:45 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-NURxxS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:26:45 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)) 17:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:26:45 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-2bqiek-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:26:45 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)) 17:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:26:45 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-0TxYBp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-NpSZ20-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-5QvQaF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-x0z6P4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-aOpPYg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-_sN79Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-BnSvW9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-LAmTg2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-fsUhE9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:26:46 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)) 17:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:26:46 INFO - Running setup.py (path:/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/pip-b2MRpc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:26:46 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)) 17:26:46 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)) 17:26:46 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)) 17:26:46 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)) 17:26:46 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)) 17:26:46 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)) 17:26:46 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:26:46 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 17:26:46 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 17:26:46 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 17:26:46 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 17:26:46 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 17:26:46 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 17:26:49 INFO - Downloading blessings-1.6.tar.gz 17:26:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:26:49 INFO - Installing collected packages: blessings 17:26:49 INFO - Running setup.py install for blessings 17:26:49 INFO - Successfully installed blessings 17:26:49 INFO - Cleaning up... 17:26:49 INFO - Return code: 0 17:26:49 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:26:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:26:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:26:50 INFO - Reading from file tmpfile_stdout 17:26:50 INFO - Current package versions: 17:26:50 INFO - blessings == 1.6 17:26:50 INFO - blobuploader == 1.2.4 17:26:50 INFO - docopt == 0.6.1 17:26:50 INFO - functools32 == 3.2.3-2 17:26:50 INFO - jsonschema == 2.5.1 17:26:50 INFO - manifestparser == 1.1 17:26:50 INFO - mozInstall == 1.12 17:26:50 INFO - mozcrash == 0.17 17:26:50 INFO - mozdebug == 0.1 17:26:50 INFO - mozdevice == 0.48 17:26:50 INFO - mozfile == 1.2 17:26:50 INFO - mozhttpd == 0.7 17:26:50 INFO - mozinfo == 0.9 17:26:50 INFO - mozleak == 0.1 17:26:50 INFO - mozlog == 3.4 17:26:50 INFO - moznetwork == 0.27 17:26:50 INFO - mozprocess == 0.23 17:26:50 INFO - mozprofile == 0.28 17:26:50 INFO - mozrunner == 6.12 17:26:50 INFO - mozscreenshot == 0.1 17:26:50 INFO - mozsystemmonitor == 0.3 17:26:50 INFO - moztest == 0.7 17:26:50 INFO - mozversion == 1.4 17:26:50 INFO - psutil == 3.1.1 17:26:50 INFO - requests == 1.2.3 17:26:50 INFO - wsgiref == 0.1.2 17:26:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:26:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:26:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:50 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 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:50 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 17:26:50 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 17:26:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:50 INFO - 'HOME': '/Users/cltbld', 17:26:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:50 INFO - 'LOGNAME': 'cltbld', 17:26:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:50 INFO - 'MOZ_NO_REMOTE': '1', 17:26:50 INFO - 'NO_EM_RESTART': '1', 17:26:50 INFO - 'PAGER': '/bin/cat', 17:26:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:50 INFO - 'PWD': '/builds/slave/test', 17:26:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:50 INFO - 'SHELL': '/bin/bash', 17:26:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:50 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:50 INFO - 'USER': 'cltbld', 17:26:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:50 INFO - 'XPC_FLAGS': '0x0', 17:26:50 INFO - 'XPC_SERVICE_NAME': '0', 17:26:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 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)) 17:26:51 INFO - Cleaning up... 17:26:51 INFO - Return code: 0 17:26:51 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:26: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')]} 17:26:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:26:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26: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')]} 17:26:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:26:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:26:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1063f0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106366570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faa23d77b60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, '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.MGFVOrzDfi/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.ifB5XESfyM/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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 17:26:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 17:26:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 17:26:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:26:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:26:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:26:51 INFO - 'HOME': '/Users/cltbld', 17:26:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:26:51 INFO - 'LOGNAME': 'cltbld', 17:26:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:26:51 INFO - 'MOZ_NO_REMOTE': '1', 17:26:51 INFO - 'NO_EM_RESTART': '1', 17:26:51 INFO - 'PAGER': '/bin/cat', 17:26:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:26:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:26:51 INFO - 'PWD': '/builds/slave/test', 17:26:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:26:51 INFO - 'SHELL': '/bin/bash', 17:26:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:26:51 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:26:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:26:51 INFO - 'USER': 'cltbld', 17:26:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:26:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:26:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:26:51 INFO - 'XPC_FLAGS': '0x0', 17:26:51 INFO - 'XPC_SERVICE_NAME': '0', 17:26:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:26:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 17:26:51 INFO - Cleaning up... 17:26:51 INFO - Return code: 0 17:26:51 INFO - Running post-action listener: _resource_record_post_action 17:26:51 INFO - Running post-action listener: _start_resource_monitoring 17:26:51 INFO - Starting resource monitoring. 17:26:51 INFO - [mozharness: 2016-10-21 00:26:51.868937Z] Finished create-virtualenv step (success) 17:26:51 INFO - [mozharness: 2016-10-21 00:26:51.869946Z] Running install step. 17:26:51 INFO - Running pre-action listener: _resource_record_pre_action 17:26:51 INFO - Running main action method: install 17:26:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:26:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:26:52 INFO - Reading from file tmpfile_stdout 17:26:52 INFO - Detecting whether we're running mozinstall >=1.0... 17:26:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:26:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:26:52 INFO - Reading from file tmpfile_stdout 17:26:52 INFO - Output received: 17:26:52 INFO - Usage: mozinstall [options] installer 17:26:52 INFO - Options: 17:26:52 INFO - -h, --help show this help message and exit 17:26:52 INFO - -d DEST, --destination=DEST 17:26:52 INFO - Directory to install application into. [default: 17:26:52 INFO - "/builds/slave/test"] 17:26:52 INFO - --app=APP Application being installed. [default: firefox] 17:26:52 INFO - mkdir: /builds/slave/test/build/application 17:26:52 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'] 17:26:52 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 17:27:27 INFO - Reading from file tmpfile_stdout 17:27:27 INFO - Output received: 17:27:27 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 17:27:27 INFO - Running post-action listener: _resource_record_post_action 17:27:27 INFO - [mozharness: 2016-10-21 00:27:27.173295Z] Finished install step (success) 17:27:27 INFO - [mozharness: 2016-10-21 00:27:27.173426Z] Running run-tests step. 17:27:27 INFO - Running pre-action listener: _resource_record_pre_action 17:27:27 INFO - Running main action method: run_tests 17:27:27 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:27:27 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:27:27 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:27:27 INFO - 2016-10-20 17:27:27.187 screenresolution[1925:10546] starting screenresolution argv=screenresolution get 17:27:27 INFO - 2016-10-20 17:27:27.190 screenresolution[1925:10546] Display 0: 1600x1200x32@60 17:27:27 INFO - 2016-10-20 17:27:27.196 screenresolution[1926:10550] starting screenresolution argv=screenresolution list 17:27:27 INFO - Available Modes on Display 0 17:27:27 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:27:27 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:27:27 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:27:27 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:27:27 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:27:27 INFO - Intel Iris: 17:27:27 INFO - Chipset Model: Intel Iris 17:27:27 INFO - Type: GPU 17:27:27 INFO - Bus: Built-In 17:27:27 INFO - VRAM (Dynamic, Max): 1536 MB 17:27:27 INFO - Vendor: Intel (0x8086) 17:27:27 INFO - Device ID: 0x0a2e 17:27:27 INFO - Revision ID: 0x0009 17:27:27 INFO - Displays: 17:27:27 INFO - Display: 17:27:27 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:27:27 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:27:27 INFO - Display Serial Number: 1600x1200 60 17:27:27 INFO - Main Display: Yes 17:27:27 INFO - Mirror: Off 17:27:27 INFO - Online: Yes 17:27:27 INFO - Rotation: Supported 17:27:27 INFO - Return code: 0 17:27:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:27:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:27:27 INFO - Python 2.7.3 17:27:27 INFO - Return code: 0 17:27:27 INFO - grabbing minidump binary from tooltool 17:27:27 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')]} 17:27:27 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 0x106204d30>, '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 0x10602adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1061fcb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:27:27 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 17:27:27 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 17:27:27 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 17:27:27 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:27:27 INFO - Return code: 0 17:27:27 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 17:27:27 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:27:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:27:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 17:27:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:27:27 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/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0117', '--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 17:27:27 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/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0117 --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 17:27:27 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.MGFVOrzDfi/Render', 17:27:27 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:27:27 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:27:27 INFO - 'HOME': '/Users/cltbld', 17:27:27 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:27:27 INFO - 'LOGNAME': 'cltbld', 17:27:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:27:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 17:27:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:27:27 INFO - 'MOZ_NO_REMOTE': '1', 17:27:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:27:27 INFO - 'NO_EM_RESTART': '1', 17:27:27 INFO - 'PAGER': '/bin/cat', 17:27:27 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:27:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:27:27 INFO - 'PWD': '/builds/slave/test', 17:27:27 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:27:27 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:27:27 INFO - 'SHELL': '/bin/bash', 17:27:27 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.ifB5XESfyM/Listeners', 17:27:27 INFO - 'TMPDIR': '/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/', 17:27:27 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:27:27 INFO - 'USER': 'cltbld', 17:27:27 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:27:27 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:27:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:27:27 INFO - 'XPC_FLAGS': '0x0', 17:27:27 INFO - 'XPC_SERVICE_NAME': '0', 17:27:27 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:27:27 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/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0117', '--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 17:27:27 INFO - mozversion application_buildid: 20161020151049 17:27:27 INFO - mozversion application_changeset: ba6fc133264d8e7aa8adf43d9d88f48b6dc2ffac 17:27:27 INFO - mozversion application_display_name: Nightly 17:27:27 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:27:27 INFO - mozversion application_name: Firefox 17:27:27 INFO - mozversion application_remotingname: firefox 17:27:27 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 17:27:27 INFO - mozversion application_vendor: Mozilla 17:27:27 INFO - mozversion application_version: 52.0a1 17:27:27 INFO - mozversion platform_buildid: 20161020151049 17:27:27 INFO - mozversion platform_changeset: ba6fc133264d8e7aa8adf43d9d88f48b6dc2ffac 17:27:27 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 17:27:27 INFO - mozversion platform_version: 52.0a1 17:27:27 INFO - using testdate: 1477009647 17:27:27 INFO - actual date: 1477009647 17:27:27 INFO - starting webserver on 'localhost:49781' 17:27:27 INFO - SUITE-START | Running 2 tests 17:27:27 INFO - TEST-START | dromaeo_css 17:27:27 INFO - operating with platform_type : mac_ 17:27:27 INFO - Initialising browser for dromaeo_css test... 17:27:27 INFO - TEST-INFO | started process 1936 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/tmp1xzMAr/profile http://localhost:49781/getInfo.html) 17:27:29 INFO - PROCESS | 1936 | __metrics Screen width/height:1600/1200 17:27:29 INFO - PROCESS | 1936 | colorDepth:24 17:27:29 INFO - PROCESS | 1936 | Browser inner width/height: 1024/689 17:27:30 INFO - PROCESS | 1936 | __metrics 17:27:30 INFO - PROCESS | 1936 | 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" 17:27:30 INFO - PROCESS | 1936 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 17:27:30 INFO - TEST-INFO | 1936: exit 0 17:27:30 INFO - Browser initialized. 17:27:30 INFO - Running cycle 1/1 for dromaeo_css test... 17:27:30 INFO - TEST-INFO | started process 1938 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/tmp1xzMAr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:27:42 INFO - PROCESS | 1938 | RSS: Main: 231313408 17:27:42 INFO - PROCESS | 1938 | 17:28:33 INFO - PROCESS | 1938 | 1477009713816 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] 17:30:47 INFO - PROCESS | 1938 | Cycle 1(1): loaded http://localhost:49781/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49781/tests/dromaeo/cssquery-ext.html) 17:30:49 INFO - PROCESS | 1938 | RSS: Main: 408166400 17:30:49 INFO - PROCESS | 1938 | 17:33:52 INFO - PROCESS | 1938 | Cycle 1(1): loaded http://localhost:49781/tests/dromaeo/cssquery-ext.html (next: http://localhost:49781/tests/dromaeo/cssquery-jquery.html) 17:33:53 INFO - PROCESS | 1938 | RSS: Main: 370163712 17:33:53 INFO - PROCESS | 1938 | 17:36:55 INFO - PROCESS | 1938 | Cycle 1(1): loaded http://localhost:49781/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49781/tests/dromaeo/cssquery-mootools.html) 17:36:56 INFO - PROCESS | 1938 | RSS: Main: 345583616 17:36:56 INFO - PROCESS | 1938 | 17:39:58 INFO - PROCESS | 1938 | Cycle 1(1): loaded http://localhost:49781/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49781/tests/dromaeo/cssquery-prototype.html) 17:39:58 INFO - PROCESS | 1938 | RSS: Main: 353185792 17:39:58 INFO - PROCESS | 1938 | 17:43:02 INFO - PROCESS | 1938 | Cycle 1(1): loaded http://localhost:49781/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49781/tests/dromaeo/cssquery-yui.html) 17:43:02 INFO - PROCESS | 1938 | RSS: Main: 329883648 17:43:02 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | Cycle 1(1): loaded http://localhost:49781/tests/dromaeo/cssquery-yui.html (next: http://localhost:49781/tests/dromaeo/cssquery-dojo.html) 17:46:06 INFO - PROCESS | 1938 | RSS: Main: 412336128 17:46:06 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | __start_tp_report 17:46:06 INFO - PROCESS | 1938 | _x_x_mozilla_page_load 17:46:06 INFO - PROCESS | 1938 | _x_x_mozilla_page_load_details 17:46:06 INFO - PROCESS | 1938 | |i|pagename|runs| 17:46:06 INFO - PROCESS | 1938 | |0;dojo.html;3277.5903012123485;3298.8020718756875;3304.917377065573;3330.4837750148736;3369.258763072123;5475.0966090595;5564.638298510594;5626.718664066801;5628.521575666068;5656.010198215311;5584.46947539983;5626.127950167731;5700.315962084555;5703.201551782754;5708.77164913404;5019.774110165033;5090.720010399426;5126.256692779545;5155.200943853709;5158.252053452247;5236.345456817898;5255.1329030709885;5259.737013149346;5271.499207575274;5327.440618735016;5220.947790522122;5225.817096401608;5234.136367499358;5257.7108259045735;5311.097113490697;4275.957240427587;5089.287499750038;5091.847244582668;5152;5162.19985902182;5087.694738315713;5094.159463688524;5109.310243117169;5160.174372100483;5197.064528384889;4728.243481043051;5607.186957891083;5619.353774315965;5619.971900140514;5627.803026894039;5995.850103747398;6047;6049.334573196945;6132.080187971796;6175.505959523227;6106.114613381079;6109.419605137549;6136.955099227258;6176.320604733476;6204.193454850885;5698.772049118072;5698.943010569924;5706.144078388275;5714.914276285859;5737.39757325479;6117.337768062934;6271.655058971709;6304.810855674337;6377.840553986188;6383.2978372379;5989.431004054608;6006.249218847644;6064.514838812885;6090.056041313604;6121.47967422774;6167.753289868445;6216.2540495140875;6225.470834978987;6244.2819075805955;6248.4064013918605;6032.4570788629235;6051.304100028465;6109.327973922865;6147.231596050494;6162.322144564095;5975.760969561169;6015.729292181863;6023.909641355383;6096.359882212392;6110.969445152746;4864.489228631013;4869.63477739171;4876.4879687633;4878.341423907798;4886.413630364379;4302.22559939214;4308.418363520947;4432.357308190359;4433.955660443355;4434.977825110854;5550.306211723535;5604.635698679573;5623.803166889221;5629.240052592848;5630.859228519238;6089.399035960755;6107.61364822091;6127.5404344674325;6130.049842274366;6140.6315621061985;4775.785089670973;5646.463585959327;5678.063119585222;5678.488935995781;5692.8861422771315;5292.655977361459;5309.5752339812725;5311.973440132774;5340.652857564323;5344.225087362311;6336.651484168323;6337.90493142594;6347.5556711029785;6350.174477317919;6350.920343541609;6052.546059045501;6119.388061193845;6137.907931381123;6147.170132032118;6199.56603037783;6262.561620686508;6300.117983482224;6327.3988971047675;6338.366163383625;6356.904646430215;5070.670406423571;5992.131140984446;6111.297200821962;6116.35778243278;6123.908141377972;6196.969015154896;6213.782517611862;6217.191765070512;6224.253089629274;6224.408681175281;4936.284238785284;5867.119932010232;5881.088431293157;5910.7931222407005;5965.761369545169;6005.189299444519;6049.879002420015;6054.243219597551;6077.179580756718;6094.969525152346;5737.282839645044;5853.560982926212;5880.000399931936;5883.970580147072;5886.823395298148;5852.648841069549;5918.378570250062;5943.613665111754;6024.638521688713;6038.245219347582;4728.361671174347;5774.8845023098465;5847.7368518417625;5853.853653658693;5888.970555147197 17:46:06 INFO - PROCESS | 1938 | |1;ext.html;468.93551637782247;489;501.6989806116331;503.4059809424877;505.12361053572045;25803;40435.191296174096;41523.792381038125;41732.37401438981;41736.58263417373;42937.7853110734;43344.566554334524;43380;43508.782456087756;43537;9593.328467007295;9768.511574421285;9776.560054797515;9779;9779.804403911918;8717.953845538545;8947;11647.35939523326;11891.22707024045;11932.627747808983;11748.471318790675;11799.646010619652;11807.468663910102;11818.349990750505;11930.105242106833;11688.883111168907;11770.411479425995;11771.7057073573;11772.705682357924;11782.823257651142;8704.260137888286;8925.642974281021;8930;9003.864942025875;9004.729858104267;39845;40571.11718800757;40793.38809917853;42356.57643423588;42590.361144582545;3343.498475228711;3399.3201359728155;3494.178867966026;4022.1352409232154;4104.734619723104;31201.687983120333;31252.687473125206;31701.52447713286;31992.680073199437;32241.1939701507;3207.8075315480914;3215.517672349143;3216.195951012247;3321.3523362944234;3322.401967645823;453439.7328013339;454617;454752;457568;460074.9999999966;51243.48756512462;52082.73958630258;52297.47702523002;55950.72024639932;55986.440135598124;62160.68919655373;63732.36267637357;63885;68297.31702683009;68430;12469.75060498785;15840;16022.75965860513;16047.518574442785;16048.839511604969;11162.888371116347;12357.32034738098;12421.19262247951;12455.626331210078;12461.875381246253;13856.168629882037;15102.924485377722;15277.388904443698;16807;17281.654366912593;6533.901991470132;6534.313897040837;6583.473322134314;6613.305602911625;6638.933610663928;742.6843591473602;946.7017889364828;998.3909815012836;1023.8805672258502;1047.8009178256107;29049.273768155967;30195;30219.395612087636;30647.540286895714;30895.84552077225;1053.441675911768;1056.1128651932413;1060.0565496707936;1080.827067669169;1139.5327915554583;15255;15524.14617196065;15563.688726225411;15810.893237473496;15873.521247276429;633111;638696;639197;639466;639897;58849;59151.40848591459;59181;59285;59332.11001834976;1251.418090587881;1288.3686993373367;1371.4514194321953;1402.4880918464687;1415.2074838090703;27817.44365112727;29148.417031659672;31741.88903388463;31805.36389272248;32459.35081298408;49913.75043124761;50632.493675062775;50739;50753;50763.746181268856;496857;497015;497483;497945;498173;23264.76735232626;25954.22137335883;26794.464110718065;26799.464010719286;40417.59582404138;37479.625203747615;40828.57100001605;42002.78998604987;45546;47599;37788.05529861665;39457.40813887851;39706.205875881744;40842.79578602207;41345.79327103345;38307.61692383041;38961;39760.80119599384;40498;40537.79731101326;38505.80747096246;39121;39677.206455871295;39797;39845.60154398419;28529.857350713944;34468.48297275593;35098.47352289667;35262.58949641985;35286.29427411489;25168.24495265145;25441;25551.488970220118;25607.359816004748;26051.73948260493 17:46:06 INFO - PROCESS | 1938 | |2;jquery.html;372.4785300579189;374.5767282970243;380.5965676383033;392.57405714799444;400.74752905669425;16033.518994430156;16300.83699163008;17453.12734363283;18642.440726778186;21451.67822482662;17754.733678994824;20644.277450289243;20658.586828263462;20893.791062089374;21412;5738.254026976487;6034.215551978236;6035.426634469718;6036.456718895299;6040.063790112539;4139.586041395852;4356.063446359032;5764.9423505765035;5908.97045514774;5935.584509084344;6469.676516174196;6617.106690596756;6626.304238055007;6638.56849304796;6654.800355989328;6301.6849157542165;6444.065610486453;6507.316731743146;6515.804525864231;6519.217693876718;5485.0949593317055;5562.249096371978;5660.462256085665;5665;5666.575006874501;26394.208173754818;26455.73544264552;26456.47087058248;26689.599656005175;26737.73262267372;2196.2313190383397;2212.23677831148;2506.323292710976;2513.4847356291916;2820.9012684556146;9799.804003919953;10339.689809305733;10391.636292729718;10445.582176712922;15103.47137850181;1823.5258832703594;1915.7030660247544;1942.630900128985;1969.5174682202808;2006.9297574584818;120121.39939300335;121570.17644735335;123683.52632947291;125315;126380.36809815984;9379.296552758571;10954.41161031646;11378.203525753283;11462;11514.36670983104;14442.205678687773;14452;14464.710705785825;14504.419823206954;14527.491537796126;6786;8080.232377924088;8413;8493.660253589787;8522.87215691765;6652.234992975773;8271.416793664253;8276.172382761795;8461.196186362286;8467.915320846836;4502.234620114523;4518.796654150571;4532.478764942074;4549.431321084864;4639.768011599474;1576.6216108133965;1769.9911500442415;1794.42890159348;1812.3294381078822;1885.208212550732;917.3165991336364;923.6905636611676;944.8960614332418;951.6526467839327;1003.6838395905266;16076.75884861728;19541;21218.681719774217;21268.042938067825;21368.465788355414;907.328576853124;928.5310917986374;937.8218138553653;955.6559638530124;995.930284880066;7978.920210797934;10880.673579792461;11412.486438110305;11440.485178167002;11517.884821151682;549368;553045;553981;567819;570908;79560.6021969898;86283;106929.930700692;130522;142285;962.6919385796477;989.7080361293436;995.9791214005558;1011.5650270383805;1019.673704414595;16342.591435214215;18244.726329104808;18444.35444759427;19252.8074719251;19253.8074619252;41378.586214137475;48394.758026209645;51888;52846.735766320926;55325.72337138288;78064.21935780569;79549.60225198837;81569.77645335205;82502;82840;5378.1151182510675;7217.927820721936;7521.398288137046;8216.589170541329;8289;11804.527818887149;12615.621531354074;12722.491100355883;12855.678608034874;13139.868601314247;10683.412412317397;10806.13550915909;11109.277896936674;11109.333439993627;11367.829482557934;10861.67414977552;10885.455727213766;10919.945400272947;11331.603393881174;11362;9018.819623607622;11241.943790280997;11456.026237769884;11468.770624587629;11692.415379231175;7982.84034319322;8120.512769233865;8222.136675648972;8281.83436331282;8371.539565323723;10720.517576709222;10903.672889813319;10952.288101273392;11252.156088293246;11324.716882078013 17:46:06 INFO - PROCESS | 1938 | |3;mootools.html;1536.853998870107;1561.2662048837046;1806.3858288182016;1895.1566552883955;1969.596232772281;7866.331361834236;8146.429749917494;8326.95836520818;8800.823983520333;8814.42706224095;7975.601219938994;8423.957880210606;8662.30701543875;8670.263027642643;8731.65073397065;2351.6472529120597;2383.5828729972186;2389.2832150354825;2391.7488663690324;2392.6530653055383;2318.1422873536817;2359.2214569192124;2360.1857359211044;2363.4918492524102;2364.2316247219637;2073.554185850042;2149;2150.064721845994;2150.8171805396482;2155.3210738617363;2144.4638840289927;2289.988550057256;2363.6690863279155;2366.562185995579;2368.4434157972864;2304.8501847379866;2332.3702600297993;2338.7193536775526;2346.9295921122393;2349.565330413879;8500.234978851871;8696.608652610648;8770.386072974894;8777.517236551987;8791.384603077788;5233.084210263189;5377.784888604451;5382.138857782775;5390.5418039466695;5396.568274538066;3580.9820950895078;3593.9640603594153;3655.926881462356;3659.9268014639824;3666.2667466506805;1067.9199060070525;1076.0692001418795;1086.6305456144948;1094.2067001423984;1102.200904344352;11343.205975581712;11403.31580105188;11464.598739044093;11492.885071149181;11519.712007199803;4306.590873866978;4363.432753742057;4536.61438777701;4543.727376357429;4554.066416384633;9046.502442365601;9054.411463254999;9060.320475964198;9065.41074830134;9069;5207.973960130175;5210.114280572236;5212.270282160501;5214.869628259324;5216.06110900034;4073.9388909166387;4693.906121877543;4866.416030076413;4885.682430641997;4886.633502487328;3101.8449077546034;3563.6792688658147;3578.7137029037613;3596.4065929121925;3642.617525159873;1130.4630300607146;1133.7449073958294;1137.7383201863452;1144.084732214242;1149.5689116581282;589.9148397348346;785.5365334452586;841.7096101844854;930.5951910918772;977.0864241933815;4935.037667654773;5731.8853622928145;5906.8818623627285;5914.438128377883;6004.099385092271;960.4237457525569;975.3465178330536;980.7744218829566;982.258394911837;989.9158571521501;3850.5764365919727;3874.6900247980093;3997.4403583498333;4032.536258330271;4107.753534787922;9374.531273436438;10090.646827361006;10244;10584.947075264574;10608.787824243625;10111.241656875764;10539.63111291101;10543.31468454548;10556.736081597868;10580.047795698423;7835.216478352233;8157;8157.673693052211;8158.67365305393;8164.306033987059;4313.094250207491;5793.102069179284;5875.970620146872;5940.257467816523;5976.8804623908145;8426.283765879969;9170.761947137318;9419.717408477756;9773.41359518431;9795.608175672893;8424.28393586552;9796.16732577739;9930.404175749478;9979.900200997898;10102.09081182697;6870.31296870329;6946.270641582561;7058.647067646494;7063.293670632896;7068.71725130989;7957.204279571996;8005.439619226599;8066.838663226586;8067.112617612175;8094.271515563628;7200.387967022652;7305.1233851938105;7364.77905662831;7395.852082958419;7532.171461139161;7179.317964793337;7257.52826066304;7314.48798584094;7326.047613810384;7343.302386273295;6614.768483103068;6790.72837086511;6844.623545704835;6900.93099069023;6978.930210697828;4957.7273249971595;4980.526849949249;5016.924746128738;5072.82245121419;5126.436092029949;4932.926006109983;4945.67853089548;4980.153373926513;5005.3993520776285;5083.694978301313 17:46:06 INFO - PROCESS | 1938 | |4;prototype.html;299.49684529989617;300.97291243788055;310.8585593554933;315.2324090838808;316.14325178765546;5275.498827611375;5332.013577488167;5349.8127565535215;5362.302900622918;5368.892622147555;4533.20668882945;4973.278874563186;5186.481351864812;5191.689698084354;5273.604479664031;3716.940671908507;4054.452648892406;4066.308727516322;4068.8982775430554;4069.6773548596675;3699.021023752293;3730.4404339349044;4057.695672824535;4107.240160570289;4110.362893751473;3255.951160732591;3358.781679190845;3794.8425730152294;3952.1502876881464;3994.4208089826957;3942.9605703943166;3956;3973.9006524836823;3977.880663580097;4000.519937607491;2890.3930174663346;2987.4025194960877;3146.889858854952;3450.2236996675797;3455.8055634671914;4509.864704058883;4803.591694705954;4852.738288045134;5007.549320561167;5186.662866913676;4525.7284562926;4558.931616025762;4562.292844609091;4563.977180114078;4602.355670206174;5216.4522725114075;5529.511719726099;5536.612437129403;5539.362973258087;5576.888462230773;3795.8291876865605;3798.620137986207;3800.8642869632386;3801.825475727743;3806.771593704359;4597.172508948388;5223.138182199932;5717.828465146053;5868.325142608569;5895.882082358329;3360.9327813443592;3822.3502004659276;3822.4519069776784;3829.8468061277795;3854.6338097880657;3277.557529733503;3405.3529829332347;3432.9485057724155;3451.361498122805;3915.6280153385383;4379.715318504287;4537.591616754508;4612.308153776893;4620.976895115503;4637.6289896808175;5612.747426365823;5627.549796016309;5647.407022262685;5671;5674.858128546737;1113.209621168979;1262.1606631590073;1290.7934730443085;1331.7003674173234;1344.8655134486473;824.6681609201097;861.2205953611991;887.6804350433839;893.2228960804142;894.4812009034745;5199.402068762065;5206.5314121729225;5237.895242095213;5264.894702105937;5325.6272060956135;4582.679212455096;5430.913817236568;5727.5131613812455;5750.769969201185;5800.274965629296;5166.250893620404;5177.4630431089245;5206.609504287194;5223.138182199895;5227.398849132398;2829.5755636654667;2982.9410559251587;2997.2956355256497;2998.7301142897245;2999.6550396704656;4639.628829693616;5196.947205853667;5344.43883392246;5872.236609240771;5889.9679610534295;4860.513948605182;5134.87162820925;5481.917771233435;5746.626469279567;5819.73811178498;5217.739113044257;5870.3249126350165;5905.911411328833;5911.280810826982;5942.405759424023;4708.340832283415;5286.259923610621;5632.549396048388;5638.577106716931;5679.9148012779015;5003.424606170337;5510.614257001971;5533.201709444366;5590.301212348457;5597.944020559742;4571.565701258375;5923.134212722978;5925.703864698232;5949.940500594938;5954.702264886825;3806.333891568909;3836.6547010769164;3865.729398942047;3884.4950156479476;3923.6468717815533;5381.327334083239;5764.221830052889;5840.386759390372;5864.618799778001;5886.793962211302;4917.950820491749;5461.1808228766;5656.547476201812;5719.628224165416;5727.76852976612;4452.5992660660695;5653.010723123355;5657.971710141423;5658.349289831722;5673.971630141823;4617.99117383939;4639.652026098123;4644.140833945731;4832;5247.265382846481;5500.394956554695;5638.520725738358;5645.68948707825;5649.694928466893;5655.575831812548;4891.046245981999;5491.588130890119;5520.503154716095;5522.30971128609;5538.695371754592 17:46:06 INFO - PROCESS | 1938 | |5;yui.html;717.2648035763342;754.5736658787786;759.4152502573019;781.9491733037352;833.9041010283819;15312.310946007428;15947.760783588255;15993.680126397465;16022.35910563576;16052.518424447257;14372.137671739703;14515.056521326107;14526.927365363184;14546.927265363685;14567.125972441661;686.9759558415457;712.305502135419;714.3285311806911;850.3112478892086;863.7840539865018;877.8902637170354;882.898466676334;894.8031433084743;896.5069211933443;900.2168113741054;947.0718695678239;948.5352177433043;949.7768024514234;950.2777888804524;952.8189643967659;717.3042149115349;750.1485813601547;945.8581212818063;947.2422062350092;950.1591091883698;671.392389887153;699.566268913272;701.2041333086933;702.4801646781397;703.0298188499888;15166.696666066728;15287.312070956723;15289;15300.923495382563;15323.540293791204;13803.309834508334;13997.090189137674;14101.083429577147;14127.505537306248;14300.92849535756;12795.808062879065;12830.80753788694;12874.29191394473;13060.281684507348;13103.86896131036;4481.278380189071;4514.210013247702;4610.308453731934;4637.466691330506;4663.370444989917;102824;103476;103693;103874.48062759638;104005;10741.409222492837;10900;11296.830547541793;11307.773844523064;11499.137564682682;22064.117435302407;22073.11707531713;22098.558028839332;22101.66847497289;22130.88934555317;7394.445416593777;7477.5613718768245;7597.734079307198;7778.105517865405;7779.72770953014;4233.597808208216;4269.530351661315;4305.117450922553;4339.674524410681;4391.231534481453;3427.4516077427493;3506.386382383073;3524.6475352465063;3529.982350088233;3531.9823400882833;653.9149910511699;657.0768070860448;658.8484648530768;671.5735507952485;680.5134328954722;472.7825200407782;522.9645302301465;597.7130977131002;639.232920495398;639.6226226526372;8733.956330218309;8904.283179859854;8922.955385223033;8935.553222338856;9037.548122593844;588.8292395205428;613.3988691082675;622.4056026494686;622.6544267931251;631.5926227583275;4228.746275223496;4265.50946641134;4303.63419109373;4561.703489273186;4607.493175750665;139333;148899.51100489072;160953.19523402542;163285;164766.52850207256;29231.707682922897;39110;39134.804325978184;39163.804180978914;42437;117888;119058;120331.79668203206;122383;122768.38615806864;8555.230029297392;8567.657293708431;8589.742307730778;8651.067956336972;8946;48997;54593.727031364586;55429;55466.73785265342;61466.078008830795;73760;80360;82626;95458.5227073888;99186.5040674792;11511.827322590001;13114.60656180316;13127.324349182245;13219.140755850838;13666.86333136656;12337.50649973991;14469.348879300247;14689.70620587561;14818.40726370933;14921.403143874557;11975.28148311104;13646.727065458834;13689.247091410069;13843.723125537634;14068.507602233873;11963.760724785281;12439.756024397488;12658.303793291458;13931.442742290195;13936;13314.600561983156;13555.932220338835;13583.45666173342;13632.113912595649;13634.659133521742;9347.579358928728;11101.500432480396;11305.321680699184;11418.429078546205;11632.53469861196;10421.270511064153;11229.55081796719;11257.831132533182;11441;11443.25618834773 17:46:06 INFO - PROCESS | 1938 | __end_tp_report 17:46:06 INFO - PROCESS | 1938 | __start_cc_report 17:46:06 INFO - PROCESS | 1938 | _x_x_mozilla_cycle_collect,1751 17:46:06 INFO - PROCESS | 1938 | __end_cc_report 17:46:06 INFO - PROCESS | 1938 | __startTimestamp1477010766523__endTimestamp 17:46:06 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | ------- Summary: start ------- 17:46:06 INFO - PROCESS | 1938 | Number of tests: 6 17:46:06 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | [#0] dojo.html Cycles:165 Average:5644.09 Median:5853.56 stddev:650.56 (11.1%) stddev-sans-first:625.51 17:46:06 INFO - PROCESS | 1938 | Values: 3277.6 3298.8 3304.9 3330.5 3369.3 5475.1 5564.6 5626.7 5628.5 5656.0 5584.5 5626.1 5700.3 5703.2 5708.8 5019.8 5090.7 5126.3 5155.2 5158.3 5236.3 5255.1 5259.7 5271.5 5327.4 5220.9 5225.8 5234.1 5257.7 5311.1 4276.0 5089.3 5091.8 5152.0 5162.2 5087.7 5094.2 5109.3 5160.2 5197.1 4728.2 5607.2 5619.4 5620.0 5627.8 5995.9 6047.0 6049.3 6132.1 6175.5 6106.1 6109.4 6137.0 6176.3 6204.2 5698.8 5698.9 5706.1 5714.9 5737.4 6117.3 6271.7 6304.8 6377.8 6383.3 5989.4 6006.2 6064.5 6090.1 6121.5 6167.8 6216.3 6225.5 6244.3 6248.4 6032.5 6051.3 6109.3 6147.2 6162.3 5975.8 6015.7 6023.9 6096.4 6111.0 4864.5 4869.6 4876.5 4878.3 4886.4 4302.2 4308.4 4432.4 4434.0 4435.0 5550.3 5604.6 5623.8 5629.2 5630.9 6089.4 6107.6 6127.5 6130.0 6140.6 4775.8 5646.5 5678.1 5678.5 5692.9 5292.7 5309.6 5312.0 5340.7 5344.2 6336.7 6337.9 6347.6 6350.2 6350.9 6052.5 6119.4 6137.9 6147.2 6199.6 6262.6 6300.1 6327.4 6338.4 6356.9 5070.7 5992.1 6111.3 6116.4 6123.9 6197.0 6213.8 6217.2 6224.3 6224.4 4936.3 5867.1 5881.1 5910.8 5965.8 6005.2 6049.9 6054.2 6077.2 6095.0 5737.3 5853.6 5880.0 5884.0 5886.8 5852.6 5918.4 5943.6 6024.6 6038.2 4728.4 5774.9 5847.7 5853.9 5889.0 17:46:06 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | [#1] ext.html Cycles:180 Average:67053.10 Median:39691.71 stddev:143056.63 (360.4%) stddev-sans-first:143370.59 17:46:06 INFO - PROCESS | 1938 | Values: 468.9 489.0 501.7 503.4 505.1 25803.0 40435.2 41523.8 41732.4 41736.6 42937.8 43344.6 43380.0 43508.8 43537.0 9593.3 9768.5 9776.6 9779.0 9779.8 8718.0 8947.0 11647.4 11891.2 11932.6 11748.5 11799.6 11807.5 11818.3 11930.1 11688.9 11770.4 11771.7 11772.7 11782.8 8704.3 8925.6 8930.0 9003.9 9004.7 39845.0 40571.1 40793.4 42356.6 42590.4 3343.5 3399.3 3494.2 4022.1 4104.7 31201.7 31252.7 31701.5 31992.7 32241.2 3207.8 3215.5 3216.2 3321.4 3322.4 453439.7 454617.0 454752.0 457568.0 460075.0 51243.5 52082.7 52297.5 55950.7 55986.4 62160.7 63732.4 63885.0 68297.3 68430.0 12469.8 15840.0 16022.8 16047.5 16048.8 11162.9 12357.3 12421.2 12455.6 12461.9 13856.2 15102.9 15277.4 16807.0 17281.7 6533.9 6534.3 6583.5 6613.3 6638.9 742.7 946.7 998.4 1023.9 1047.8 29049.3 30195.0 30219.4 30647.5 30895.8 1053.4 1056.1 1060.1 1080.8 1139.5 15255.0 15524.1 15563.7 15810.9 15873.5 633111.0 638696.0 639197.0 639466.0 639897.0 58849.0 59151.4 59181.0 59285.0 59332.1 1251.4 1288.4 1371.5 1402.5 1415.2 27817.4 29148.4 31741.9 31805.4 32459.4 49913.8 50632.5 50739.0 50753.0 50763.7 496857.0 497015.0 497483.0 497945.0 498173.0 23264.8 25954.2 26794.5 26799.5 40417.6 37479.6 40828.6 42002.8 45546.0 47599.0 37788.1 39457.4 39706.2 40842.8 41345.8 38307.6 38961.0 39760.8 40498.0 40537.8 38505.8 39121.0 39677.2 39797.0 39845.6 28529.9 34468.5 35098.5 35262.6 35286.3 25168.2 25441.0 25551.5 25607.4 26051.7 17:46:06 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | [#2] jquery.html Cycles:180 Average:33468.46 Median:14779.32 stddev:93494.00 (632.6%) stddev-sans-first:93723.25 17:46:06 INFO - PROCESS | 1938 | Values: 372.5 374.6 380.6 392.6 400.7 16033.5 16300.8 17453.1 18642.4 21451.7 17754.7 20644.3 20658.6 20893.8 21412.0 5738.3 6034.2 6035.4 6036.5 6040.1 4139.6 4356.1 5764.9 5909.0 5935.6 6469.7 6617.1 6626.3 6638.6 6654.8 6301.7 6444.1 6507.3 6515.8 6519.2 5485.1 5562.2 5660.5 5665.0 5666.6 26394.2 26455.7 26456.5 26689.6 26737.7 2196.2 2212.2 2506.3 2513.5 2820.9 9799.8 10339.7 10391.6 10445.6 15103.5 1823.5 1915.7 1942.6 1969.5 2006.9 120121.4 121570.2 123683.5 125315.0 126380.4 9379.3 10954.4 11378.2 11462.0 11514.4 14442.2 14452.0 14464.7 14504.4 14527.5 6786.0 8080.2 8413.0 8493.7 8522.9 6652.2 8271.4 8276.2 8461.2 8467.9 4502.2 4518.8 4532.5 4549.4 4639.8 1576.6 1770.0 1794.4 1812.3 1885.2 917.3 923.7 944.9 951.7 1003.7 16076.8 19541.0 21218.7 21268.0 21368.5 907.3 928.5 937.8 955.7 995.9 7978.9 10880.7 11412.5 11440.5 11517.9 549368.0 553045.0 553981.0 567819.0 570908.0 79560.6 86283.0 106929.9 130522.0 142285.0 962.7 989.7 996.0 1011.6 1019.7 16342.6 18244.7 18444.4 19252.8 19253.8 41378.6 48394.8 51888.0 52846.7 55325.7 78064.2 79549.6 81569.8 82502.0 82840.0 5378.1 7217.9 7521.4 8216.6 8289.0 11804.5 12615.6 12722.5 12855.7 13139.9 10683.4 10806.1 11109.3 11109.3 11367.8 10861.7 10885.5 10919.9 11331.6 11362.0 9018.8 11241.9 11456.0 11468.8 11692.4 7982.8 8120.5 8222.1 8281.8 8371.5 10720.5 10903.7 10952.3 11252.2 11324.7 17:46:06 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | [#3] mootools.html Cycles:180 Average:5547.56 Median:5105.07 stddev:3072.04 (60.2%) stddev-sans-first:3065.87 17:46:06 INFO - PROCESS | 1938 | Values: 1536.9 1561.3 1806.4 1895.2 1969.6 7866.3 8146.4 8327.0 8800.8 8814.4 7975.6 8424.0 8662.3 8670.3 8731.7 2351.6 2383.6 2389.3 2391.7 2392.7 2318.1 2359.2 2360.2 2363.5 2364.2 2073.6 2149.0 2150.1 2150.8 2155.3 2144.5 2290.0 2363.7 2366.6 2368.4 2304.9 2332.4 2338.7 2346.9 2349.6 8500.2 8696.6 8770.4 8777.5 8791.4 5233.1 5377.8 5382.1 5390.5 5396.6 3581.0 3594.0 3655.9 3659.9 3666.3 1067.9 1076.1 1086.6 1094.2 1102.2 11343.2 11403.3 11464.6 11492.9 11519.7 4306.6 4363.4 4536.6 4543.7 4554.1 9046.5 9054.4 9060.3 9065.4 9069.0 5208.0 5210.1 5212.3 5214.9 5216.1 4073.9 4693.9 4866.4 4885.7 4886.6 3101.8 3563.7 3578.7 3596.4 3642.6 1130.5 1133.7 1137.7 1144.1 1149.6 589.9 785.5 841.7 930.6 977.1 4935.0 5731.9 5906.9 5914.4 6004.1 960.4 975.3 980.8 982.3 989.9 3850.6 3874.7 3997.4 4032.5 4107.8 9374.5 10090.6 10244.0 10584.9 10608.8 10111.2 10539.6 10543.3 10556.7 10580.0 7835.2 8157.0 8157.7 8158.7 8164.3 4313.1 5793.1 5876.0 5940.3 5976.9 8426.3 9170.8 9419.7 9773.4 9795.6 8424.3 9796.2 9930.4 9979.9 10102.1 6870.3 6946.3 7058.6 7063.3 7068.7 7957.2 8005.4 8066.8 8067.1 8094.3 7200.4 7305.1 7364.8 7395.9 7532.2 7179.3 7257.5 7314.5 7326.0 7343.3 6614.8 6790.7 6844.6 6900.9 6978.9 4957.7 4980.5 5016.9 5072.8 5126.4 4932.9 4945.7 4980.2 5005.4 5083.7 17:46:06 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | [#4] prototype.html Cycles:180 Average:4485.17 Median:5150.56 stddev:1395.04 (27.1%) stddev-sans-first:1363.12 17:46:06 INFO - PROCESS | 1938 | Values: 299.5 301.0 310.9 315.2 316.1 5275.5 5332.0 5349.8 5362.3 5368.9 4533.2 4973.3 5186.5 5191.7 5273.6 3716.9 4054.5 4066.3 4068.9 4069.7 3699.0 3730.4 4057.7 4107.2 4110.4 3256.0 3358.8 3794.8 3952.2 3994.4 3943.0 3956.0 3973.9 3977.9 4000.5 2890.4 2987.4 3146.9 3450.2 3455.8 4509.9 4803.6 4852.7 5007.5 5186.7 4525.7 4558.9 4562.3 4564.0 4602.4 5216.5 5529.5 5536.6 5539.4 5576.9 3795.8 3798.6 3800.9 3801.8 3806.8 4597.2 5223.1 5717.8 5868.3 5895.9 3360.9 3822.4 3822.5 3829.8 3854.6 3277.6 3405.4 3432.9 3451.4 3915.6 4379.7 4537.6 4612.3 4621.0 4637.6 5612.7 5627.5 5647.4 5671.0 5674.9 1113.2 1262.2 1290.8 1331.7 1344.9 824.7 861.2 887.7 893.2 894.5 5199.4 5206.5 5237.9 5264.9 5325.6 4582.7 5430.9 5727.5 5750.8 5800.3 5166.3 5177.5 5206.6 5223.1 5227.4 2829.6 2982.9 2997.3 2998.7 2999.7 4639.6 5196.9 5344.4 5872.2 5890.0 4860.5 5134.9 5481.9 5746.6 5819.7 5217.7 5870.3 5905.9 5911.3 5942.4 4708.3 5286.3 5632.5 5638.6 5679.9 5003.4 5510.6 5533.2 5590.3 5597.9 4571.6 5923.1 5925.7 5949.9 5954.7 3806.3 3836.7 3865.7 3884.5 3923.6 5381.3 5764.2 5840.4 5864.6 5886.8 4918.0 5461.2 5656.5 5719.6 5727.8 4452.6 5653.0 5658.0 5658.3 5674.0 4618.0 4639.7 4644.1 4832.0 5247.3 5500.4 5638.5 5645.7 5649.7 5655.6 4891.0 5491.6 5520.5 5522.3 5538.7 17:46:06 INFO - PROCESS | 1938 | 17:46:06 INFO - PROCESS | 1938 | [#5] yui.html Cycles:180 Average:22297.12 Median:39122.40 stddev:36144.63 (92.4%) stddev-sans-first:36209.71 17:46:06 INFO - PROCESS | 1938 | Values: 717.3 754.6 759.4 781.9 833.9 15312.3 15947.8 15993.7 16022.4 16052.5 14372.1 14515.1 14526.9 14546.9 14567.1 687.0 712.3 714.3 850.3 863.8 877.9 882.9 894.8 896.5 900.2 947.1 948.5 949.8 950.3 952.8 717.3 750.1 945.9 947.2 950.2 671.4 699.6 701.2 702.5 703.0 15166.7 15287.3 15289.0 15300.9 15323.5 13803.3 13997.1 14101.1 14127.5 14300.9 12795.8 12830.8 12874.3 13060.3 13103.9 4481.3 4514.2 4610.3 4637.5 4663.4 102824.0 103476.0 103693.0 103874.5 104005.0 10741.4 10900.0 11296.8 11307.8 11499.1 22064.1 22073.1 22098.6 22101.7 22130.9 7394.4 7477.6 7597.7 7778.1 7779.7 4233.6 4269.5 4305.1 4339.7 4391.2 3427.5 3506.4 3524.6 3530.0 3532.0 653.9 657.1 658.8 671.6 680.5 472.8 523.0 597.7 639.2 639.6 8734.0 8904.3 8923.0 8935.6 9037.5 588.8 613.4 622.4 622.7 631.6 4228.7 4265.5 4303.6 4561.7 4607.5 139333.0 148899.5 160953.2 163285.0 164766.5 29231.7 39110.0 39134.8 39163.8 42437.0 117888.0 119058.0 120331.8 122383.0 122768.4 8555.2 8567.7 8589.7 8651.1 8946.0 48997.0 54593.7 55429.0 55466.7 61466.1 73760.0 80360.0 82626.0 95458.5 99186.5 11511.8 13114.6 13127.3 13219.1 13666.9 12337.5 14469.3 14689.7 14818.4 14921.4 11975.3 13646.7 13689.2 13843.7 14068.5 11963.8 12439.8 12658.3 13931.4 13936.0 13314.6 13555.9 13583.5 13632.1 13634.7 9347.6 11101.5 11305.3 11418.4 11632.5 10421.3 11229.6 11257.8 11441.0 11443.3 17:46:06 INFO - PROCESS | 1938 | -------- Summary: end -------- 17:46:06 INFO - PROCESS | 1938 | 17:46:07 INFO - TEST-INFO | 1938: exit 0 17:46:07 INFO - TEST-OK | dromaeo_css | took 1119384ms 17:46:07 INFO - TEST-START | kraken 17:46:07 INFO - operating with platform_type : mac_ 17:46:07 INFO - Initialising browser for kraken test... 17:46:07 INFO - TEST-INFO | started process 1942 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/tmphYTwo8/profile http://localhost:49781/getInfo.html) 17:46:09 INFO - PROCESS | 1942 | __metrics Screen width/height:1600/1200 17:46:09 INFO - PROCESS | 1942 | colorDepth:24 17:46:09 INFO - PROCESS | 1942 | Browser inner width/height: 1024/689 17:46:09 INFO - PROCESS | 1942 | __metrics 17:46:09 INFO - PROCESS | 1942 | 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" 17:46:09 INFO - PROCESS | 1942 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 17:46:10 INFO - TEST-INFO | 1942: exit 0 17:46:10 INFO - Browser initialized. 17:46:10 INFO - Running cycle 1/1 for kraken test... 17:46:10 INFO - TEST-INFO | started process 1943 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/T/tmphYTwo8/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:46:22 INFO - PROCESS | 1943 | RSS: Main: 239853568 17:46:22 INFO - PROCESS | 1943 | 17:46:25 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49781/tests/kraken/driver.html?testName=audio-beat-detection) 17:46:26 INFO - PROCESS | 1943 | RSS: Main: 290619392 17:46:26 INFO - PROCESS | 1943 | 17:46:28 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49781/tests/kraken/driver.html?testName=audio-dft) 17:46:29 INFO - PROCESS | 1943 | RSS: Main: 289394688 17:46:29 INFO - PROCESS | 1943 | 17:46:32 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49781/tests/kraken/driver.html?testName=audio-fft) 17:46:33 INFO - PROCESS | 1943 | RSS: Main: 384045056 17:46:33 INFO - PROCESS | 1943 | 17:46:35 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49781/tests/kraken/driver.html?testName=audio-oscillator) 17:46:36 INFO - PROCESS | 1943 | RSS: Main: 288137216 17:46:36 INFO - PROCESS | 1943 | 17:46:38 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49781/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:46:38 INFO - PROCESS | 1943 | RSS: Main: 289533952 17:46:38 INFO - PROCESS | 1943 | 17:46:41 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49781/tests/kraken/driver.html?testName=imaging-darkroom) 17:46:42 INFO - PROCESS | 1943 | RSS: Main: 327102464 17:46:42 INFO - PROCESS | 1943 | 17:46:45 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49781/tests/kraken/driver.html?testName=imaging-desaturate) 17:46:45 INFO - PROCESS | 1943 | RSS: Main: 327163904 17:46:45 INFO - PROCESS | 1943 | 17:46:48 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49781/tests/kraken/driver.html?testName=json-parse-financial) 17:46:49 INFO - PROCESS | 1943 | RSS: Main: 325578752 17:46:49 INFO - PROCESS | 1943 | 17:46:50 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49781/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:46:51 INFO - PROCESS | 1943 | RSS: Main: 302940160 17:46:51 INFO - PROCESS | 1943 | 17:46:53 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49781/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:46:53 INFO - PROCESS | 1943 | RSS: Main: 306089984 17:46:53 INFO - PROCESS | 1943 | 17:46:56 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49781/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:46:56 INFO - PROCESS | 1943 | RSS: Main: 308715520 17:46:56 INFO - PROCESS | 1943 | 17:46:59 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49781/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:47:00 INFO - PROCESS | 1943 | RSS: Main: 318144512 17:47:00 INFO - PROCESS | 1943 | 17:47:03 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49781/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:47:04 INFO - PROCESS | 1943 | RSS: Main: 317964288 17:47:04 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | Cycle 1(1): loaded http://localhost:49781/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49781/tests/kraken/driver.html?testName=ai-astar) 17:47:06 INFO - PROCESS | 1943 | RSS: Main: 361943040 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | __start_tp_report 17:47:06 INFO - PROCESS | 1943 | _x_x_mozilla_page_load 17:47:06 INFO - PROCESS | 1943 | _x_x_mozilla_page_load_details 17:47:06 INFO - PROCESS | 1943 | |i|pagename|runs| 17:47:06 INFO - PROCESS | 1943 | |0;ai-astar;113;113;112;113;114;112;111;113;112;112 17:47:06 INFO - PROCESS | 1943 | |1;audio-beat-detection;148;114;112;148;115;113;112;114;141;110 17:47:06 INFO - PROCESS | 1943 | |2;audio-dft;182;185;184;183;183;184;184;180;181;185 17:47:06 INFO - PROCESS | 1943 | |3;audio-fft;84;75;84;115;62;59;67;84;114;82 17:47:06 INFO - PROCESS | 1943 | |4;audio-oscillator;85;70;95;69;67;68;92;67;67;90 17:47:06 INFO - PROCESS | 1943 | |5;imaging-gaussian-blur;89;87;89;86;87;85;92;129;120;86 17:47:06 INFO - PROCESS | 1943 | |6;imaging-darkroom;94;100;143;94;94;96;94;94;94;94 17:47:06 INFO - PROCESS | 1943 | |7;imaging-desaturate;84;84;82;79;81;81;83;82;81;82 17:47:06 INFO - PROCESS | 1943 | |8;json-parse-financial;57;52;53;75;86;85;84;54;54;54 17:47:06 INFO - PROCESS | 1943 | |9;json-stringify-tinderbox;66;74;68;76;72;69;70;71;72;71 17:47:06 INFO - PROCESS | 1943 | |10;stanford-crypto-aes;89;87;90;86;86;84;88;86;86;83 17:47:06 INFO - PROCESS | 1943 | |11;stanford-crypto-ccm;152;161;149;144;146;145;147;150;196;149 17:47:06 INFO - PROCESS | 1943 | |12;stanford-crypto-pbkdf2;172;175;181;171;172;174;172;238;205;171 17:47:06 INFO - PROCESS | 1943 | |13;stanford-crypto-sha256-iterative;71;72;62;63;75;86;88;87;88;87 17:47:06 INFO - PROCESS | 1943 | __end_tp_report 17:47:06 INFO - PROCESS | 1943 | __start_cc_report 17:47:06 INFO - PROCESS | 1943 | _x_x_mozilla_cycle_collect,1989 17:47:06 INFO - PROCESS | 1943 | __end_cc_report 17:47:06 INFO - PROCESS | 1943 | __startTimestamp1477010826258__endTimestamp 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | ------- Summary: start ------- 17:47:06 INFO - PROCESS | 1943 | Number of tests: 14 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#0] ai-astar Cycles:10 Average:112.50 Median:113.00 stddev:0.85 (0.8%) stddev-sans-first:0.88 17:47:06 INFO - PROCESS | 1943 | Values: 113.0 113.0 112.0 113.0 114.0 112.0 111.0 113.0 112.0 112.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#1] audio-beat-detection Cycles:10 Average:122.70 Median:114.50 stddev:16.02 (14.0%) stddev-sans-first:14.14 17:47:06 INFO - PROCESS | 1943 | Values: 148.0 114.0 112.0 148.0 115.0 113.0 112.0 114.0 141.0 110.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#2] audio-dft Cycles:10 Average:183.10 Median:184.00 stddev:1.66 (0.9%) stddev-sans-first:1.72 17:47:06 INFO - PROCESS | 1943 | Values: 182.0 185.0 184.0 183.0 183.0 184.0 184.0 180.0 181.0 185.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#3] audio-fft Cycles:10 Average:82.60 Median:78.50 stddev:19.22 (24.5%) stddev-sans-first:20.38 17:47:06 INFO - PROCESS | 1943 | Values: 84.0 75.0 84.0 115.0 62.0 59.0 67.0 84.0 114.0 82.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#4] audio-oscillator Cycles:10 Average:77.00 Median:77.50 stddev:11.91 (15.4%) stddev-sans-first:12.27 17:47:06 INFO - PROCESS | 1943 | Values: 85.0 70.0 95.0 69.0 67.0 68.0 92.0 67.0 67.0 90.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#5] imaging-gaussian-blur Cycles:10 Average:95.00 Median:87.00 stddev:15.82 (18.2%) stddev-sans-first:16.63 17:47:06 INFO - PROCESS | 1943 | Values: 89.0 87.0 89.0 86.0 87.0 85.0 92.0 129.0 120.0 86.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#6] imaging-darkroom Cycles:10 Average:99.70 Median:94.00 stddev:15.33 (16.3%) stddev-sans-first:16.12 17:47:06 INFO - PROCESS | 1943 | Values: 94.0 100.0 143.0 94.0 94.0 96.0 94.0 94.0 94.0 94.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#7] imaging-desaturate Cycles:10 Average:81.90 Median:82.00 stddev:1.52 (1.9%) stddev-sans-first:1.41 17:47:06 INFO - PROCESS | 1943 | Values: 84.0 84.0 82.0 79.0 81.0 81.0 83.0 82.0 81.0 82.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#8] json-parse-financial Cycles:10 Average:65.40 Median:66.00 stddev:15.06 (22.8%) stddev-sans-first:15.66 17:47:06 INFO - PROCESS | 1943 | Values: 57.0 52.0 53.0 75.0 86.0 85.0 84.0 54.0 54.0 54.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#9] json-stringify-tinderbox Cycles:10 Average:70.90 Median:71.50 stddev:2.88 (4.0%) stddev-sans-first:2.46 17:47:06 INFO - PROCESS | 1943 | Values: 66.0 74.0 68.0 76.0 72.0 69.0 70.0 71.0 72.0 71.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#10] stanford-crypto-aes Cycles:10 Average:86.50 Median:86.50 stddev:2.12 (2.5%) stddev-sans-first:2.05 17:47:06 INFO - PROCESS | 1943 | Values: 89.0 87.0 90.0 86.0 86.0 84.0 88.0 86.0 86.0 83.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#11] stanford-crypto-ccm Cycles:10 Average:153.90 Median:149.50 stddev:15.55 (10.4%) stddev-sans-first:16.48 17:47:06 INFO - PROCESS | 1943 | Values: 152.0 161.0 149.0 144.0 146.0 145.0 147.0 150.0 196.0 149.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:183.10 Median:174.50 stddev:21.88 (12.5%) stddev-sans-first:22.84 17:47:06 INFO - PROCESS | 1943 | Values: 172.0 175.0 181.0 171.0 172.0 174.0 172.0 238.0 205.0 171.0 17:47:06 INFO - PROCESS | 1943 | 17:47:06 INFO - PROCESS | 1943 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:77.90 Median:86.50 stddev:10.55 (12.2%) stddev-sans-first:10.89 17:47:06 INFO - PROCESS | 1943 | Values: 71.0 72.0 62.0 63.0 75.0 86.0 88.0 87.0 88.0 87.0 17:47:06 INFO - PROCESS | 1943 | -------- Summary: end -------- 17:47:06 INFO - PROCESS | 1943 | 17:47:07 INFO - TEST-INFO | 1943: exit 0 17:47:07 INFO - TEST-OK | kraken | took 60013ms 17:47:07 INFO - SUITE-END | took 1179s 17:47:07 INFO - Completed test suite (00:19:39) 17:47:07 INFO - javascript benchmark 17:47:07 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3277.5903012123485, 3298.8020718756875, 3304.917377065573, 3330.4837750148736, 3369.258763072123, 5475.0966090595, 5564.638298510594, 5626.718664066801, 5628.521575666068, 5656.010198215311, 5584.46947539983, 5626.127950167731, 5700.315962084555, 5703.201551782754, 5708.77164913404, 5019.774110165033, 5090.720010399426, 5126.256692779545, 5155.200943853709, 5158.252053452247, 5236.345456817898, 5255.1329030709885, 5259.737013149346, 5271.499207575274, 5327.440618735016, 5220.947790522122, 5225.817096401608, 5234.136367499358, 5257.7108259045735, 5311.097113490697, 4275.957240427587, 5089.287499750038, 5091.847244582668, 5152.0, 5162.19985902182, 5087.694738315713, 5094.159463688524, 5109.310243117169, 5160.174372100483, 5197.064528384889, 4728.243481043051, 5607.186957891083, 5619.353774315965, 5619.971900140514, 5627.803026894039, 5995.850103747398, 6047.0, 6049.334573196945, 6132.080187971796, 6175.505959523227, 6106.114613381079, 6109.419605137549, 6136.955099227258, 6176.320604733476, 6204.193454850885, 5698.772049118072, 5698.943010569924, 5706.144078388275, 5714.914276285859, 5737.39757325479, 6117.337768062934, 6271.655058971709, 6304.810855674337, 6377.840553986188, 6383.2978372379, 5989.431004054608, 6006.249218847644, 6064.514838812885, 6090.056041313604, 6121.47967422774, 6167.753289868445, 6216.2540495140875, 6225.470834978987, 6244.2819075805955, 6248.4064013918605, 6032.4570788629235, 6051.304100028465, 6109.327973922865, 6147.231596050494, 6162.322144564095, 5975.760969561169, 6015.729292181863, 6023.909641355383, 6096.359882212392, 6110.969445152746, 4864.489228631013, 4869.63477739171, 4876.4879687633, 4878.341423907798, 4886.413630364379, 4302.22559939214, 4308.418363520947, 4432.357308190359, 4433.955660443355, 4434.977825110854, 5550.306211723535, 5604.635698679573, 5623.803166889221, 5629.240052592848, 5630.859228519238, 6089.399035960755, 6107.61364822091, 6127.5404344674325, 6130.049842274366, 6140.6315621061985, 4775.785089670973, 5646.463585959327, 5678.063119585222, 5678.488935995781, 5692.8861422771315, 5292.655977361459, 5309.5752339812725, 5311.973440132774, 5340.652857564323, 5344.225087362311, 6336.651484168323, 6337.90493142594, 6347.5556711029785, 6350.174477317919, 6350.920343541609, 6052.546059045501, 6119.388061193845, 6137.907931381123, 6147.170132032118, 6199.56603037783, 6262.561620686508, 6300.117983482224, 6327.3988971047675, 6338.366163383625, 6356.904646430215, 5070.670406423571, 5992.131140984446, 6111.297200821962, 6116.35778243278, 6123.908141377972, 6196.969015154896, 6213.782517611862, 6217.191765070512, 6224.253089629274, 6224.408681175281, 4936.284238785284, 5867.119932010232, 5881.088431293157, 5910.7931222407005, 5965.761369545169, 6005.189299444519, 6049.879002420015, 6054.243219597551, 6077.179580756718, 6094.969525152346, 5737.282839645044, 5853.560982926212, 5880.000399931936, 5883.970580147072, 5886.823395298148, 5852.648841069549, 5918.378570250062, 5943.613665111754, 6024.638521688713, 6038.245219347582, 4728.361671174347, 5774.8845023098465, 5847.7368518417625, 5853.853653658693, 5888.970555147197], "value": 5603.07501896386, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [468.93551637782247, 489.0, 501.6989806116331, 503.4059809424877, 505.12361053572045, 25803.0, 40435.191296174096, 41523.792381038125, 41732.37401438981, 41736.58263417373, 42937.7853110734, 43344.566554334524, 43380.0, 43508.782456087756, 43537.0, 9593.328467007295, 9768.511574421285, 9776.560054797515, 9779.0, 9779.804403911918, 8717.953845538545, 8947.0, 11647.35939523326, 11891.22707024045, 11932.627747808983, 11748.471318790675, 11799.646010619652, 11807.468663910102, 11818.349990750505, 11930.105242106833, 11688.883111168907, 11770.411479425995, 11771.7057073573, 11772.705682357924, 11782.823257651142, 8704.260137888286, 8925.642974281021, 8930.0, 9003.864942025875, 9004.729858104267, 39845.0, 40571.11718800757, 40793.38809917853, 42356.57643423588, 42590.361144582545, 3343.498475228711, 3399.3201359728155, 3494.178867966026, 4022.1352409232154, 4104.734619723104, 31201.687983120333, 31252.687473125206, 31701.52447713286, 31992.680073199437, 32241.1939701507, 3207.8075315480914, 3215.517672349143, 3216.195951012247, 3321.3523362944234, 3322.401967645823, 453439.7328013339, 454617.0, 454752.0, 457568.0, 460074.9999999966, 51243.48756512462, 52082.73958630258, 52297.47702523002, 55950.72024639932, 55986.440135598124, 62160.68919655373, 63732.36267637357, 63885.0, 68297.31702683009, 68430.0, 12469.75060498785, 15840.0, 16022.75965860513, 16047.518574442785, 16048.839511604969, 11162.888371116347, 12357.32034738098, 12421.19262247951, 12455.626331210078, 12461.875381246253, 13856.168629882037, 15102.924485377722, 15277.388904443698, 16807.0, 17281.654366912593, 6533.901991470132, 6534.313897040837, 6583.473322134314, 6613.305602911625, 6638.933610663928, 742.6843591473602, 946.7017889364828, 998.3909815012836, 1023.8805672258502, 1047.8009178256107, 29049.273768155967, 30195.0, 30219.395612087636, 30647.540286895714, 30895.84552077225, 1053.441675911768, 1056.1128651932413, 1060.0565496707936, 1080.827067669169, 1139.5327915554583, 15255.0, 15524.14617196065, 15563.688726225411, 15810.893237473496, 15873.521247276429, 633111.0, 638696.0, 639197.0, 639466.0, 639897.0, 58849.0, 59151.40848591459, 59181.0, 59285.0, 59332.11001834976, 1251.418090587881, 1288.3686993373367, 1371.4514194321953, 1402.4880918464687, 1415.2074838090703, 27817.44365112727, 29148.417031659672, 31741.88903388463, 31805.36389272248, 32459.35081298408, 49913.75043124761, 50632.493675062775, 50739.0, 50753.0, 50763.746181268856, 496857.0, 497015.0, 497483.0, 497945.0, 498173.0, 23264.76735232626, 25954.22137335883, 26794.464110718065, 26799.464010719286, 40417.59582404138, 37479.625203747615, 40828.57100001605, 42002.78998604987, 45546.0, 47599.0, 37788.05529861665, 39457.40813887851, 39706.205875881744, 40842.79578602207, 41345.79327103345, 38307.61692383041, 38961.0, 39760.80119599384, 40498.0, 40537.79731101326, 38505.80747096246, 39121.0, 39677.206455871295, 39797.0, 39845.60154398419, 28529.857350713944, 34468.48297275593, 35098.47352289667, 35262.58949641985, 35286.29427411489, 25168.24495265145, 25441.0, 25551.488970220118, 25607.359816004748, 26051.73948260493], "value": 19946.334295597633, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [372.4785300579189, 374.5767282970243, 380.5965676383033, 392.57405714799444, 400.74752905669425, 16033.518994430156, 16300.83699163008, 17453.12734363283, 18642.440726778186, 21451.67822482662, 17754.733678994824, 20644.277450289243, 20658.586828263462, 20893.791062089374, 21412.0, 5738.254026976487, 6034.215551978236, 6035.426634469718, 6036.456718895299, 6040.063790112539, 4139.586041395852, 4356.063446359032, 5764.9423505765035, 5908.97045514774, 5935.584509084344, 6469.676516174196, 6617.106690596756, 6626.304238055007, 6638.56849304796, 6654.800355989328, 6301.6849157542165, 6444.065610486453, 6507.316731743146, 6515.804525864231, 6519.217693876718, 5485.0949593317055, 5562.249096371978, 5660.462256085665, 5665.0, 5666.575006874501, 26394.208173754818, 26455.73544264552, 26456.47087058248, 26689.599656005175, 26737.73262267372, 2196.2313190383397, 2212.23677831148, 2506.323292710976, 2513.4847356291916, 2820.9012684556146, 9799.804003919953, 10339.689809305733, 10391.636292729718, 10445.582176712922, 15103.47137850181, 1823.5258832703594, 1915.7030660247544, 1942.630900128985, 1969.5174682202808, 2006.9297574584818, 120121.39939300335, 121570.17644735335, 123683.52632947291, 125315.0, 126380.36809815984, 9379.296552758571, 10954.41161031646, 11378.203525753283, 11462.0, 11514.36670983104, 14442.205678687773, 14452.0, 14464.710705785825, 14504.419823206954, 14527.491537796126, 6786.0, 8080.232377924088, 8413.0, 8493.660253589787, 8522.87215691765, 6652.234992975773, 8271.416793664253, 8276.172382761795, 8461.196186362286, 8467.915320846836, 4502.234620114523, 4518.796654150571, 4532.478764942074, 4549.431321084864, 4639.768011599474, 1576.6216108133965, 1769.9911500442415, 1794.42890159348, 1812.3294381078822, 1885.208212550732, 917.3165991336364, 923.6905636611676, 944.8960614332418, 951.6526467839327, 1003.6838395905266, 16076.75884861728, 19541.0, 21218.681719774217, 21268.042938067825, 21368.465788355414, 907.328576853124, 928.5310917986374, 937.8218138553653, 955.6559638530124, 995.930284880066, 7978.920210797934, 10880.673579792461, 11412.486438110305, 11440.485178167002, 11517.884821151682, 549368.0, 553045.0, 553981.0, 567819.0, 570908.0, 79560.6021969898, 86283.0, 106929.930700692, 130522.0, 142285.0, 962.6919385796477, 989.7080361293436, 995.9791214005558, 1011.5650270383805, 1019.673704414595, 16342.591435214215, 18244.726329104808, 18444.35444759427, 19252.8074719251, 19253.8074619252, 41378.586214137475, 48394.758026209645, 51888.0, 52846.735766320926, 55325.72337138288, 78064.21935780569, 79549.60225198837, 81569.77645335205, 82502.0, 82840.0, 5378.1151182510675, 7217.927820721936, 7521.398288137046, 8216.589170541329, 8289.0, 11804.527818887149, 12615.621531354074, 12722.491100355883, 12855.678608034874, 13139.868601314247, 10683.412412317397, 10806.13550915909, 11109.277896936674, 11109.333439993627, 11367.829482557934, 10861.67414977552, 10885.455727213766, 10919.945400272947, 11331.603393881174, 11362.0, 9018.819623607622, 11241.943790280997, 11456.026237769884, 11468.770624587629, 11692.415379231175, 7982.84034319322, 8120.512769233865, 8222.136675648972, 8281.83436331282, 8371.539565323723, 10720.517576709222, 10903.672889813319, 10952.288101273392, 11252.156088293246, 11324.716882078013], "value": 9475.452335636815, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1536.853998870107, 1561.2662048837046, 1806.3858288182016, 1895.1566552883955, 1969.596232772281, 7866.331361834236, 8146.429749917494, 8326.95836520818, 8800.823983520333, 8814.42706224095, 7975.601219938994, 8423.957880210606, 8662.30701543875, 8670.263027642643, 8731.65073397065, 2351.6472529120597, 2383.5828729972186, 2389.2832150354825, 2391.7488663690324, 2392.6530653055383, 2318.1422873536817, 2359.2214569192124, 2360.1857359211044, 2363.4918492524102, 2364.2316247219637, 2073.554185850042, 2149.0, 2150.064721845994, 2150.8171805396482, 2155.3210738617363, 2144.4638840289927, 2289.988550057256, 2363.6690863279155, 2366.562185995579, 2368.4434157972864, 2304.8501847379866, 2332.3702600297993, 2338.7193536775526, 2346.9295921122393, 2349.565330413879, 8500.234978851871, 8696.608652610648, 8770.386072974894, 8777.517236551987, 8791.384603077788, 5233.084210263189, 5377.784888604451, 5382.138857782775, 5390.5418039466695, 5396.568274538066, 3580.9820950895078, 3593.9640603594153, 3655.926881462356, 3659.9268014639824, 3666.2667466506805, 1067.9199060070525, 1076.0692001418795, 1086.6305456144948, 1094.2067001423984, 1102.200904344352, 11343.205975581712, 11403.31580105188, 11464.598739044093, 11492.885071149181, 11519.712007199803, 4306.590873866978, 4363.432753742057, 4536.61438777701, 4543.727376357429, 4554.066416384633, 9046.502442365601, 9054.411463254999, 9060.320475964198, 9065.41074830134, 9069.0, 5207.973960130175, 5210.114280572236, 5212.270282160501, 5214.869628259324, 5216.06110900034, 4073.9388909166387, 4693.906121877543, 4866.416030076413, 4885.682430641997, 4886.633502487328, 3101.8449077546034, 3563.6792688658147, 3578.7137029037613, 3596.4065929121925, 3642.617525159873, 1130.4630300607146, 1133.7449073958294, 1137.7383201863452, 1144.084732214242, 1149.5689116581282, 589.9148397348346, 785.5365334452586, 841.7096101844854, 930.5951910918772, 977.0864241933815, 4935.037667654773, 5731.8853622928145, 5906.8818623627285, 5914.438128377883, 6004.099385092271, 960.4237457525569, 975.3465178330536, 980.7744218829566, 982.258394911837, 989.9158571521501, 3850.5764365919727, 3874.6900247980093, 3997.4403583498333, 4032.536258330271, 4107.753534787922, 9374.531273436438, 10090.646827361006, 10244.0, 10584.947075264574, 10608.787824243625, 10111.241656875764, 10539.63111291101, 10543.31468454548, 10556.736081597868, 10580.047795698423, 7835.216478352233, 8157.0, 8157.673693052211, 8158.67365305393, 8164.306033987059, 4313.094250207491, 5793.102069179284, 5875.970620146872, 5940.257467816523, 5976.8804623908145, 8426.283765879969, 9170.761947137318, 9419.717408477756, 9773.41359518431, 9795.608175672893, 8424.28393586552, 9796.16732577739, 9930.404175749478, 9979.900200997898, 10102.09081182697, 6870.31296870329, 6946.270641582561, 7058.647067646494, 7063.293670632896, 7068.71725130989, 7957.204279571996, 8005.439619226599, 8066.838663226586, 8067.112617612175, 8094.271515563628, 7200.387967022652, 7305.1233851938105, 7364.77905662831, 7395.852082958419, 7532.171461139161, 7179.317964793337, 7257.52826066304, 7314.48798584094, 7326.047613810384, 7343.302386273295, 6614.768483103068, 6790.72837086511, 6844.623545704835, 6900.93099069023, 6978.930210697828, 4957.7273249971595, 4980.526849949249, 5016.924746128738, 5072.82245121419, 5126.436092029949, 4932.926006109983, 4945.67853089548, 4980.153373926513, 5005.3993520776285, 5083.694978301313], "value": 4476.980072587441, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [299.49684529989617, 300.97291243788055, 310.8585593554933, 315.2324090838808, 316.14325178765546, 5275.498827611375, 5332.013577488167, 5349.8127565535215, 5362.302900622918, 5368.892622147555, 4533.20668882945, 4973.278874563186, 5186.481351864812, 5191.689698084354, 5273.604479664031, 3716.940671908507, 4054.452648892406, 4066.308727516322, 4068.8982775430554, 4069.6773548596675, 3699.021023752293, 3730.4404339349044, 4057.695672824535, 4107.240160570289, 4110.362893751473, 3255.951160732591, 3358.781679190845, 3794.8425730152294, 3952.1502876881464, 3994.4208089826957, 3942.9605703943166, 3956.0, 3973.9006524836823, 3977.880663580097, 4000.519937607491, 2890.3930174663346, 2987.4025194960877, 3146.889858854952, 3450.2236996675797, 3455.8055634671914, 4509.864704058883, 4803.591694705954, 4852.738288045134, 5007.549320561167, 5186.662866913676, 4525.7284562926, 4558.931616025762, 4562.292844609091, 4563.977180114078, 4602.355670206174, 5216.4522725114075, 5529.511719726099, 5536.612437129403, 5539.362973258087, 5576.888462230773, 3795.8291876865605, 3798.620137986207, 3800.8642869632386, 3801.825475727743, 3806.771593704359, 4597.172508948388, 5223.138182199932, 5717.828465146053, 5868.325142608569, 5895.882082358329, 3360.9327813443592, 3822.3502004659276, 3822.4519069776784, 3829.8468061277795, 3854.6338097880657, 3277.557529733503, 3405.3529829332347, 3432.9485057724155, 3451.361498122805, 3915.6280153385383, 4379.715318504287, 4537.591616754508, 4612.308153776893, 4620.976895115503, 4637.6289896808175, 5612.747426365823, 5627.549796016309, 5647.407022262685, 5671.0, 5674.858128546737, 1113.209621168979, 1262.1606631590073, 1290.7934730443085, 1331.7003674173234, 1344.8655134486473, 824.6681609201097, 861.2205953611991, 887.6804350433839, 893.2228960804142, 894.4812009034745, 5199.402068762065, 5206.5314121729225, 5237.895242095213, 5264.894702105937, 5325.6272060956135, 4582.679212455096, 5430.913817236568, 5727.5131613812455, 5750.769969201185, 5800.274965629296, 5166.250893620404, 5177.4630431089245, 5206.609504287194, 5223.138182199895, 5227.398849132398, 2829.5755636654667, 2982.9410559251587, 2997.2956355256497, 2998.7301142897245, 2999.6550396704656, 4639.628829693616, 5196.947205853667, 5344.43883392246, 5872.236609240771, 5889.9679610534295, 4860.513948605182, 5134.87162820925, 5481.917771233435, 5746.626469279567, 5819.73811178498, 5217.739113044257, 5870.3249126350165, 5905.911411328833, 5911.280810826982, 5942.405759424023, 4708.340832283415, 5286.259923610621, 5632.549396048388, 5638.577106716931, 5679.9148012779015, 5003.424606170337, 5510.614257001971, 5533.201709444366, 5590.301212348457, 5597.944020559742, 4571.565701258375, 5923.134212722978, 5925.703864698232, 5949.940500594938, 5954.702264886825, 3806.333891568909, 3836.6547010769164, 3865.729398942047, 3884.4950156479476, 3923.6468717815533, 5381.327334083239, 5764.221830052889, 5840.386759390372, 5864.618799778001, 5886.793962211302, 4917.950820491749, 5461.1808228766, 5656.547476201812, 5719.628224165416, 5727.76852976612, 4452.5992660660695, 5653.010723123355, 5657.971710141423, 5658.349289831722, 5673.971630141823, 4617.99117383939, 4639.652026098123, 4644.140833945731, 4832.0, 5247.265382846481, 5500.394956554695, 5638.520725738358, 5645.68948707825, 5649.694928466893, 5655.575831812548, 4891.046245981999, 5491.588130890119, 5520.503154716095, 5522.30971128609, 5538.695371754592], "value": 4040.4136332149646, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [717.2648035763342, 754.5736658787786, 759.4152502573019, 781.9491733037352, 833.9041010283819, 15312.310946007428, 15947.760783588255, 15993.680126397465, 16022.35910563576, 16052.518424447257, 14372.137671739703, 14515.056521326107, 14526.927365363184, 14546.927265363685, 14567.125972441661, 686.9759558415457, 712.305502135419, 714.3285311806911, 850.3112478892086, 863.7840539865018, 877.8902637170354, 882.898466676334, 894.8031433084743, 896.5069211933443, 900.2168113741054, 947.0718695678239, 948.5352177433043, 949.7768024514234, 950.2777888804524, 952.8189643967659, 717.3042149115349, 750.1485813601547, 945.8581212818063, 947.2422062350092, 950.1591091883698, 671.392389887153, 699.566268913272, 701.2041333086933, 702.4801646781397, 703.0298188499888, 15166.696666066728, 15287.312070956723, 15289.0, 15300.923495382563, 15323.540293791204, 13803.309834508334, 13997.090189137674, 14101.083429577147, 14127.505537306248, 14300.92849535756, 12795.808062879065, 12830.80753788694, 12874.29191394473, 13060.281684507348, 13103.86896131036, 4481.278380189071, 4514.210013247702, 4610.308453731934, 4637.466691330506, 4663.370444989917, 102824.0, 103476.0, 103693.0, 103874.48062759638, 104005.0, 10741.409222492837, 10900.0, 11296.830547541793, 11307.773844523064, 11499.137564682682, 22064.117435302407, 22073.11707531713, 22098.558028839332, 22101.66847497289, 22130.88934555317, 7394.445416593777, 7477.5613718768245, 7597.734079307198, 7778.105517865405, 7779.72770953014, 4233.597808208216, 4269.530351661315, 4305.117450922553, 4339.674524410681, 4391.231534481453, 3427.4516077427493, 3506.386382383073, 3524.6475352465063, 3529.982350088233, 3531.9823400882833, 653.9149910511699, 657.0768070860448, 658.8484648530768, 671.5735507952485, 680.5134328954722, 472.7825200407782, 522.9645302301465, 597.7130977131002, 639.232920495398, 639.6226226526372, 8733.956330218309, 8904.283179859854, 8922.955385223033, 8935.553222338856, 9037.548122593844, 588.8292395205428, 613.3988691082675, 622.4056026494686, 622.6544267931251, 631.5926227583275, 4228.746275223496, 4265.50946641134, 4303.63419109373, 4561.703489273186, 4607.493175750665, 139333.0, 148899.51100489072, 160953.19523402542, 163285.0, 164766.52850207256, 29231.707682922897, 39110.0, 39134.804325978184, 39163.804180978914, 42437.0, 117888.0, 119058.0, 120331.79668203206, 122383.0, 122768.38615806864, 8555.230029297392, 8567.657293708431, 8589.742307730778, 8651.067956336972, 8946.0, 48997.0, 54593.727031364586, 55429.0, 55466.73785265342, 61466.078008830795, 73760.0, 80360.0, 82626.0, 95458.5227073888, 99186.5040674792, 11511.827322590001, 13114.60656180316, 13127.324349182245, 13219.140755850838, 13666.86333136656, 12337.50649973991, 14469.348879300247, 14689.70620587561, 14818.40726370933, 14921.403143874557, 11975.28148311104, 13646.727065458834, 13689.247091410069, 13843.723125537634, 14068.507602233873, 11963.760724785281, 12439.756024397488, 12658.303793291458, 13931.442742290195, 13936.0, 13314.600561983156, 13555.932220338835, 13583.45666173342, 13632.113912595649, 13634.659133521742, 9347.579358928728, 11101.500432480396, 11305.321680699184, 11418.429078546205, 11632.53469861196, 10421.270511064153, 11229.55081796719, 11257.831132533182, 11441.0, 11443.25618834773], "value": 7531.987547750161, "unit": "score"}], "name": "dromaeo_css", "value": 7242.29571702213, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 113.0, 112.0, 113.0, 114.0, 112.0, 111.0, 113.0, 112.0, 112.0], "value": 112.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 114.0, 112.0, 148.0, 115.0, 113.0, 112.0, 114.0, 141.0, 110.0], "value": 122.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [182.0, 185.0, 184.0, 183.0, 183.0, 184.0, 184.0, 180.0, 181.0, 185.0], "value": 183.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 75.0, 84.0, 115.0, 62.0, 59.0, 67.0, 84.0, 114.0, 82.0], "value": 82.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 70.0, 95.0, 69.0, 67.0, 68.0, 92.0, 67.0, 67.0, 90.0], "value": 77.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 87.0, 89.0, 86.0, 87.0, 85.0, 92.0, 129.0, 120.0, 86.0], "value": 95.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 100.0, 143.0, 94.0, 94.0, 96.0, 94.0, 94.0, 94.0, 94.0], "value": 99.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 82.0, 79.0, 81.0, 81.0, 83.0, 82.0, 81.0, 82.0], "value": 81.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 52.0, 53.0, 75.0, 86.0, 85.0, 84.0, 54.0, 54.0, 54.0], "value": 65.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 74.0, 68.0, 76.0, 72.0, 69.0, 70.0, 71.0, 72.0, 71.0], "value": 70.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 87.0, 90.0, 86.0, 86.0, 84.0, 88.0, 86.0, 86.0, 83.0], "value": 86.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 161.0, 149.0, 144.0, 146.0, 145.0, 147.0, 150.0, 196.0, 149.0], "value": 153.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [172.0, 175.0, 181.0, 171.0, 172.0, 174.0, 172.0, 238.0, 205.0, 171.0], "value": 183.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 72.0, 62.0, 63.0, 75.0, 86.0, 88.0, 87.0, 88.0, 87.0], "value": 77.9, "unit": "score"}], "name": "kraken", "value": 1492.2, "alertThreshold": 2.0}]} 17:47:07 INFO - Return code: 0 17:47:07 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 17:47:07 INFO - # TBPL SUCCESS # 17:47:07 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:47:07 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:47:07 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:47:07 INFO - 2016-10-20 17:47:07.523 screenresolution[1947:12545] starting screenresolution argv=screenresolution get 17:47:07 INFO - 2016-10-20 17:47:07.526 screenresolution[1947:12545] Display 0: 1600x1200x32@60 17:47:07 INFO - 2016-10-20 17:47:07.531 screenresolution[1948:12548] starting screenresolution argv=screenresolution list 17:47:07 INFO - Available Modes on Display 0 17:47:07 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:47:07 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:47:07 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:47:07 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:47:07 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:47:07 INFO - Intel Iris: 17:47:07 INFO - Chipset Model: Intel Iris 17:47:07 INFO - Type: GPU 17:47:07 INFO - Bus: Built-In 17:47:07 INFO - VRAM (Dynamic, Max): 1536 MB 17:47:07 INFO - Vendor: Intel (0x8086) 17:47:07 INFO - Device ID: 0x0a2e 17:47:07 INFO - Revision ID: 0x0009 17:47:07 INFO - Displays: 17:47:07 INFO - Display: 17:47:07 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:47:07 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:47:07 INFO - Display Serial Number: 1600x1200 60 17:47:07 INFO - Main Display: Yes 17:47:07 INFO - Mirror: Off 17:47:07 INFO - Online: Yes 17:47:07 INFO - Rotation: Supported 17:47:07 INFO - Return code: 0 17:47:07 INFO - Running post-action listener: _resource_record_post_action 17:47:07 INFO - [mozharness: 2016-10-21 00:47:07.772786Z] Finished run-tests step (success) 17:47:07 INFO - Running post-run listener: _resource_record_post_run 17:47:07 INFO - Total resource usage - Wall time: 1215s; CPU: 53.0%; Read bytes: 176128; Write bytes: 705057280; Read time: 5; Write time: 1905 17:47:07 INFO - TinderboxPrint: CPU usage
53.4% 17:47:07 INFO - TinderboxPrint: I/O read bytes / time
176,128 / 5 17:47:07 INFO - TinderboxPrint: I/O write bytes / time
705,057,280 / 1,905 17:47:07 INFO - TinderboxPrint: CPU idle
2,265.5 (46.6%) 17:47:07 INFO - TinderboxPrint: CPU system
974.6 (20.0%) 17:47:07 INFO - TinderboxPrint: CPU user
1,621.5 (33.4%) 17:47:07 INFO - TinderboxPrint: Swap in / out
406,364,160 / 0 17:47:07 INFO - install - Wall time: 35s; CPU: 54.0%; Read bytes: 403347968; Write bytes: 397977600; Read time: 31121; Write time: 715 17:47:07 INFO - run-tests - Wall time: 1181s; CPU: 53.0%; Read bytes: 176128; Write bytes: 294795776; Read time: 5; Write time: 1151 17:47:08 INFO - Running post-run listener: _upload_blobber_files 17:47:08 INFO - Blob upload gear active. 17:47:08 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:47:08 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 17:47:08 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'] 17:47:08 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 17:47:08 INFO - (blobuploader) - INFO - Open directory for files ... 17:47:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 17:47:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:47:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:47:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 17:47:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:47:09 INFO - (blobuploader) - INFO - Done attempting. 17:47:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 17:47:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:47:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:47:10 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 17:47:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:47:10 INFO - (blobuploader) - INFO - Done attempting. 17:47:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 17:47:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:47:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:47:12 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 17:47:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:47:12 INFO - (blobuploader) - INFO - Done attempting. 17:47:12 INFO - (blobuploader) - INFO - Iteration through files over. 17:47:12 INFO - Return code: 0 17:47:12 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:47:12 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:47:12 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/d08a6de2c3652ccf88f493258262e88bfc6864cdfa49b93de6c2346b312685c7fad4a8312cb088245b3d7bfb586b7256262a57c0ae23238b0aeb25e825e9e62f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/bd969be1d17ef41e0de79a457e33328a37dfb149eae5102984de43b1c9d79bddc4ec385449b25e8f16c7995b5a58f2b8f6fe3052e13c83b7585fb295a089be5e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8c0f1a3c8050f585b0157595b5ba0e9928b3c40c1b245d50ac2c8ca1bb77895b1358aa5771deff0fb80a4b265ec0768ec3e318981c194424af3faff52c7caccb"} 17:47:12 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:47:12 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:47:12 INFO - Contents: 17:47:12 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/d08a6de2c3652ccf88f493258262e88bfc6864cdfa49b93de6c2346b312685c7fad4a8312cb088245b3d7bfb586b7256262a57c0ae23238b0aeb25e825e9e62f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/bd969be1d17ef41e0de79a457e33328a37dfb149eae5102984de43b1c9d79bddc4ec385449b25e8f16c7995b5a58f2b8f6fe3052e13c83b7585fb295a089be5e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8c0f1a3c8050f585b0157595b5ba0e9928b3c40c1b245d50ac2c8ca1bb77895b1358aa5771deff0fb80a4b265ec0768ec3e318981c194424af3faff52c7caccb"} 17:47:12 INFO - Running post-run listener: copy_logs_to_upload_dir 17:47:12 INFO - Copying logs to upload dir... 17:47:12 INFO - mkdir: /builds/slave/test/build/upload/logs 17:47:12 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1278.461402 ========= master_lag: 1.87 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 20 secs) (at 2016-10-20 17:47:14.372659) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-20 17:47:14.376210) ========= 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.MGFVOrzDfi/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.ifB5XESfyM/Listeners TMPDIR=/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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/d08a6de2c3652ccf88f493258262e88bfc6864cdfa49b93de6c2346b312685c7fad4a8312cb088245b3d7bfb586b7256262a57c0ae23238b0aeb25e825e9e62f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/bd969be1d17ef41e0de79a457e33328a37dfb149eae5102984de43b1c9d79bddc4ec385449b25e8f16c7995b5a58f2b8f6fe3052e13c83b7585fb295a089be5e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8c0f1a3c8050f585b0157595b5ba0e9928b3c40c1b245d50ac2c8ca1bb77895b1358aa5771deff0fb80a4b265ec0768ec3e318981c194424af3faff52c7caccb"} build_url:https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011954 build_url: 'https://queue.taskcluster.net/v1/task/QLnP6dN4RB-WQ3QdP66u6w/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/d08a6de2c3652ccf88f493258262e88bfc6864cdfa49b93de6c2346b312685c7fad4a8312cb088245b3d7bfb586b7256262a57c0ae23238b0aeb25e825e9e62f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/bd969be1d17ef41e0de79a457e33328a37dfb149eae5102984de43b1c9d79bddc4ec385449b25e8f16c7995b5a58f2b8f6fe3052e13c83b7585fb295a089be5e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8c0f1a3c8050f585b0157595b5ba0e9928b3c40c1b245d50ac2c8ca1bb77895b1358aa5771deff0fb80a4b265ec0768ec3e318981c194424af3faff52c7caccb"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-20 17:47:14.422119) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-20 17:47:14.422512) ========= 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.MGFVOrzDfi/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.ifB5XESfyM/Listeners TMPDIR=/var/folders/2d/l2dyrh5107v305_74qp5tzp400000w/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.005178 ========= master_lag: 0.32 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-20 17:47:14.752096) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-20 17:47:14.752869) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-20 17:47:14.753579) ========= ========= Total master_lag: 2.31 =========