builder: mozilla-aurora_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0060 starttime: 1477216082.73 results: success (0) buildid: 20161023004025 builduid: d15bb9e033d44320bea75256c20473db revision: 96ca0ecdcfa7b14cab40e8c7a0a4d97441652a79 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:02.733332) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:02.733785) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:02.734062) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:02.758681) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:02.758957) ========= 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.GBd97ieS8T/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.YrRjbt7CFG/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-10-23 02:48:02-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 204M=0s 2016-10-23 02:48:03 (204 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.626706 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:03.407274) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:03.407589) ========= 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.GBd97ieS8T/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.YrRjbt7CFG/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.018901 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:03.455611) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-10-23 02:48:03.455928) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 96ca0ecdcfa7b14cab40e8c7a0a4d97441652a79 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 96ca0ecdcfa7b14cab40e8c7a0a4d97441652a79 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.GBd97ieS8T/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.YrRjbt7CFG/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-10-23 02:48:03,540 truncating revision to first 12 chars 2016-10-23 02:48:03,540 Setting DEBUG logging. 2016-10-23 02:48:03,540 attempt 1/10 2016-10-23 02:48:03,540 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/96ca0ecdcfa7?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-23 02:48:05,250 unpacking tar archive at: mozilla-aurora-96ca0ecdcfa7/testing/mozharness/ program finished with exit code 0 elapsedTime=1.999613 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-10-23 02:48:05.477287) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:05.477594) ========= script_repo_revision: 96ca0ecdcfa7b14cab40e8c7a0a4d97441652a79 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:05.477971) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:05.478256) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-23 02:48:05.496750) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 22 mins, 11 secs) (at 2016-10-23 02:48:05.497122) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.GBd97ieS8T/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.YrRjbt7CFG/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 02:48:05 INFO - MultiFileLogger online at 20161023 02:48:05 in /builds/slave/test 02:48:05 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 02:48:05 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:48:05 INFO - {'append_to_log': False, 02:48:05 INFO - 'base_work_dir': '/builds/slave/test', 02:48:05 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 02:48:05 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:48:05 INFO - 'branch': 'Mozilla-Aurora', 02:48:05 INFO - 'buildbot_json_path': 'buildprops.json', 02:48:05 INFO - 'config_files': ('talos/mac_config.py',), 02:48:05 INFO - 'default_actions': ('clobber', 02:48:05 INFO - 'read-buildbot-config', 02:48:05 INFO - 'download-and-extract', 02:48:05 INFO - 'populate-webroot', 02:48:05 INFO - 'create-virtualenv', 02:48:05 INFO - 'install', 02:48:05 INFO - 'run-tests'), 02:48:05 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:48:05 INFO - 'download_minidump_stackwalk': True, 02:48:05 INFO - 'download_symbols': 'ondemand', 02:48:05 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 02:48:05 INFO - 'tooltool.py': '/tools/tooltool.py', 02:48:05 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 02:48:05 INFO - '/tools/misc-python/virtualenv.py')}, 02:48:05 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:48:05 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:48:05 INFO - 'installer_path': 'installer.exe', 02:48:05 INFO - 'log_level': 'info', 02:48:05 INFO - 'log_name': 'talos', 02:48:05 INFO - 'log_to_console': True, 02:48:05 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 02:48:05 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 02:48:05 INFO - 'opt_config_files': (), 02:48:05 INFO - 'pip_index': False, 02:48:05 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 02:48:05 INFO - 'cmd': ('bash', 02:48:05 INFO - '-c', 02:48:05 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 02:48:05 INFO - 'enabled': True, 02:48:05 INFO - 'halt_on_failure': False, 02:48:05 INFO - 'name': 'check_screen_resolution'},), 02:48:05 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 02:48:05 INFO - 'cmd': ('bash', 02:48:05 INFO - '-c', 02:48:05 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 02:48:05 INFO - 'enabled': True, 02:48:05 INFO - 'halt_on_failure': False, 02:48:05 INFO - 'name': 'check_screen_resolution'},), 02:48:05 INFO - 'run_cmd_checks_enabled': True, 02:48:05 INFO - 'sps_profile': False, 02:48:05 INFO - 'sps_profile_interval': 0, 02:48:05 INFO - 'suite': 'dromaeojs', 02:48:05 INFO - 'system_bits': '32', 02:48:05 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:48:05 INFO - 'title': 't-yosemite-r7-0060', 02:48:05 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:48:05 INFO - 'use_talos_json': True, 02:48:05 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:48:05 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:48:05 INFO - 'work_dir': 'build'} 02:48:05 INFO - [mozharness: 2016-10-23 09:48:05.707562Z] Running clobber step. 02:48:05 INFO - Running pre-action listener: _resource_record_pre_action 02:48:05 INFO - Running main action method: clobber 02:48:05 INFO - rmtree: /builds/slave/test/build 02:48:05 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:48:07 INFO - Running post-action listener: _resource_record_post_action 02:48:07 INFO - [mozharness: 2016-10-23 09:48:07.261973Z] Finished clobber step (success) 02:48:07 INFO - [mozharness: 2016-10-23 09:48:07.262125Z] Running read-buildbot-config step. 02:48:07 INFO - Running pre-action listener: _resource_record_pre_action 02:48:07 INFO - Running main action method: read_buildbot_config 02:48:07 INFO - Using buildbot properties: 02:48:07 INFO - { 02:48:07 INFO - "project": "", 02:48:07 INFO - "product": "firefox", 02:48:07 INFO - "script_repo_revision": "production", 02:48:07 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs", 02:48:07 INFO - "repository": "", 02:48:07 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs", 02:48:07 INFO - "buildid": "20161023004025", 02:48:07 INFO - "stage_platform": "macosx64", 02:48:07 INFO - "basedir": "/builds/slave/test", 02:48:07 INFO - "nightly_build": "True", 02:48:07 INFO - "buildnumber": 64, 02:48:07 INFO - "slavename": "t-yosemite-r7-0060", 02:48:07 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 02:48:07 INFO - "platform": "yosemite_r7", 02:48:07 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 02:48:07 INFO - "branch": "mozilla-aurora", 02:48:07 INFO - "repo_path": "releases/mozilla-aurora", 02:48:07 INFO - "revision": "96ca0ecdcfa7b14cab40e8c7a0a4d97441652a79", 02:48:07 INFO - "pgo_build": "False", 02:48:07 INFO - "builduid": "d15bb9e033d44320bea75256c20473db", 02:48:07 INFO - "slavebuilddir": "test" 02:48:07 INFO - } 02:48:07 INFO - Found installer url https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg. 02:48:07 INFO - Running post-action listener: _resource_record_post_action 02:48:07 INFO - [mozharness: 2016-10-23 09:48:07.265700Z] Finished read-buildbot-config step (success) 02:48:07 INFO - [mozharness: 2016-10-23 09:48:07.265843Z] Running download-and-extract step. 02:48:07 INFO - Running pre-action listener: _resource_record_pre_action 02:48:07 INFO - Running main action method: download_and_extract 02:48:07 INFO - mkdir: /builds/slave/test/build/tests 02:48:07 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')]} 02:48:07 INFO - trying https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json 02:48:07 INFO - Downloading https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 02:48:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json'}, attempt #1 02:48:08 INFO - Downloaded 1199 bytes. 02:48:08 INFO - Reading from file /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 02:48:08 INFO - Using the following test package requirements: 02:48:08 INFO - {u'common': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 02:48:08 INFO - u'cppunittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 02:48:08 INFO - u'firefox-51.0a2.en-US.mac.cppunittest.tests.zip'], 02:48:08 INFO - u'gtest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 02:48:08 INFO - u'firefox-51.0a2.en-US.mac.gtest.tests.zip'], 02:48:08 INFO - u'jittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 02:48:08 INFO - u'jsshell-mac.zip'], 02:48:08 INFO - u'mochitest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 02:48:08 INFO - u'firefox-51.0a2.en-US.mac.mochitest.tests.zip'], 02:48:08 INFO - u'mozbase': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 02:48:08 INFO - u'reftest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 02:48:08 INFO - u'firefox-51.0a2.en-US.mac.reftest.tests.zip'], 02:48:08 INFO - u'talos': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 02:48:08 INFO - u'firefox-51.0a2.en-US.mac.talos.tests.zip'], 02:48:08 INFO - u'web-platform': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 02:48:08 INFO - u'firefox-51.0a2.en-US.mac.web-platform.tests.zip'], 02:48:08 INFO - u'xpcshell': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 02:48:08 INFO - u'firefox-51.0a2.en-US.mac.xpcshell.tests.zip']} 02:48:08 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip'] for test suite category: common 02:48:08 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 02:48:08 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 02:48:08 INFO - Fetch https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 02:48:09 INFO - Expected file size: 16436679 02:48:16 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip', u'firefox-51.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 02:48:16 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 02:48:16 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 02:48:16 INFO - Fetch https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 02:48:16 INFO - Expected file size: 16436679 02:48:23 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip 02:48:23 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip'}, attempt #1 02:48:23 INFO - Fetch https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip into memory 02:48:24 INFO - Expected file size: 14414081 02:48:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:48:25 INFO - trying https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 02:48:25 INFO - Downloading https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg 02:48:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg'}, attempt #1 02:48:57 WARNING - Socket error when accessing https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg: The read operation timed out 02:48:57 INFO - retry: attempt #1 caught exception: The read operation timed out 02:48:57 INFO - retry: Failed, sleeping 30 seconds before retrying 02:49:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg'}, attempt #2 02:49:30 INFO - Downloaded 115563409 bytes. 02:49:30 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 02:49:30 INFO - mkdir: /builds/slave/test/properties 02:49:30 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:49:30 INFO - Writing to file /builds/slave/test/properties/build_url 02:49:30 INFO - Contents: 02:49:30 INFO - build_url:https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 02:49:30 INFO - Running post-action listener: _resource_record_post_action 02:49:30 INFO - Running post-action listener: set_extra_try_arguments 02:49:30 INFO - [mozharness: 2016-10-23 09:49:30.928856Z] Finished download-and-extract step (success) 02:49:30 INFO - [mozharness: 2016-10-23 09:49:30.928995Z] Running populate-webroot step. 02:49:30 INFO - Running pre-action listener: _resource_record_pre_action 02:49:30 INFO - Running main action method: populate_webroot 02:49:30 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 02:49:30 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 02:49:30 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 02:49:30 INFO - '--tppagecycles', 02:49:30 INFO - '7'], 02:49:30 INFO - 'tests': ['tsvgm']}}, 02:49:30 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['tresize', 'tcanvasmark']}, 02:49:30 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 02:49:30 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['dromaeo_css', 'kraken']}, 02:49:30 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 02:49:30 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:49:30 INFO - 'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:49:30 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:49:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:49:30 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:49:30 INFO - 'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['damp', 'tps']}, 02:49:30 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:49:30 INFO - 'tests': ['damp', 'tps']}, 02:49:30 INFO - 'g3': {'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['dromaeo_dom']}, 02:49:30 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:49:30 INFO - 'g4': {'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['basic_compositor_video']}, 02:49:30 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 02:49:30 INFO - 'other': {'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['a11yr', 02:49:30 INFO - 'ts_paint', 02:49:30 INFO - 'tpaint', 02:49:30 INFO - 'sessionrestore', 02:49:30 INFO - 'sessionrestore_no_auto_restore', 02:49:30 INFO - 'tabpaint']}, 02:49:30 INFO - 'other-e10s': {'tests': ['a11yr', 02:49:30 INFO - 'ts_paint', 02:49:30 INFO - 'tpaint', 02:49:30 INFO - 'sessionrestore', 02:49:30 INFO - 'sessionrestore_no_auto_restore', 02:49:30 INFO - 'tabpaint']}, 02:49:30 INFO - 'other-e10s_l64': {'tests': ['a11yr', 02:49:30 INFO - 'ts_paint', 02:49:30 INFO - 'tpaint', 02:49:30 INFO - 'sessionrestore', 02:49:30 INFO - 'sessionrestore_no_auto_restore', 02:49:30 INFO - 'tabpaint']}, 02:49:30 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 02:49:30 INFO - 'ts_paint', 02:49:30 INFO - 'tpaint', 02:49:30 INFO - 'sessionrestore', 02:49:30 INFO - 'sessionrestore_no_auto_restore', 02:49:30 INFO - 'tabpaint']}, 02:49:30 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['a11yr', 02:49:30 INFO - 'ts_paint', 02:49:30 INFO - 'tpaint', 02:49:30 INFO - 'sessionrestore', 02:49:30 INFO - 'sessionrestore_no_auto_restore', 02:49:30 INFO - 'tabpaint']}, 02:49:30 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['a11yr', 02:49:30 INFO - 'ts_paint', 02:49:30 INFO - 'tpaint', 02:49:30 INFO - 'sessionrestore', 02:49:30 INFO - 'sessionrestore_no_auto_restore', 02:49:30 INFO - 'tabpaint']}, 02:49:30 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['tsvgx', 02:49:30 INFO - 'tsvgr_opacity', 02:49:30 INFO - 'tart', 02:49:30 INFO - 'tscrollx', 02:49:30 INFO - 'cart']}, 02:49:30 INFO - 'svgr-e10s': {'tests': ['tsvgx', 02:49:30 INFO - 'tsvgr_opacity', 02:49:30 INFO - 'tart', 02:49:30 INFO - 'tscrollx', 02:49:30 INFO - 'cart']}, 02:49:30 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:49:30 INFO - 'talos_options': ['--disable-e10s'], 02:49:30 INFO - 'tests': ['tp5o']}, 02:49:30 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:49:30 INFO - 'tests': ['tp5o']}, 02:49:30 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:49:30 INFO - 'talos_options': ['--disable-e10s', 02:49:30 INFO - '--xperf_path', 02:49:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:49:30 INFO - 'tests': ['tp5n']}, 02:49:30 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:49:30 INFO - 'talos_options': ['--xperf_path', 02:49:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:49:30 INFO - 'tests': ['tp5n']}}, 02:49:30 INFO - 'talos.zip': {'path': '', 02:49:30 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 02:49:30 INFO - Running post-action listener: _resource_record_post_action 02:49:30 INFO - [mozharness: 2016-10-23 09:49:30.947931Z] Finished populate-webroot step (success) 02:49:30 INFO - [mozharness: 2016-10-23 09:49:30.948069Z] Running create-virtualenv step. 02:49:30 INFO - Running pre-action listener: _resource_record_pre_action 02:49:30 INFO - Running main action method: create_virtualenv 02:49:30 INFO - Creating virtualenv /builds/slave/test/build/venv 02:49:30 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 02:49:30 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 02:49:31 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:49:31 INFO - Using real prefix '/tools/python27' 02:49:31 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:49:31 INFO - Installing distribute.............................................................................................................................................................................................done. 02:49:34 INFO - Installing pip.................done. 02:49:34 INFO - Return code: 0 02:49:34 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:49:34 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')]} 02:49:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:49:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:34 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')]} 02:49:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:49:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:34 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:49:34 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 02:49:34 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 02:49:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:49:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:49:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:49:34 INFO - 'HOME': '/Users/cltbld', 02:49:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:49:34 INFO - 'LOGNAME': 'cltbld', 02:49:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:49:34 INFO - 'MOZ_NO_REMOTE': '1', 02:49:34 INFO - 'NO_EM_RESTART': '1', 02:49:34 INFO - 'PAGER': '/bin/cat', 02:49:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:49:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:49:34 INFO - 'PWD': '/builds/slave/test', 02:49:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:49:34 INFO - 'SHELL': '/bin/bash', 02:49:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:49:34 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:49:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:49:34 INFO - 'USER': 'cltbld', 02:49:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:49:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:49:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:49:34 INFO - 'XPC_FLAGS': '0x0', 02:49:34 INFO - 'XPC_SERVICE_NAME': '0', 02:49:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:49:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:49:34 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 02:49:34 INFO - Cleaning up... 02:49:34 INFO - Return code: 0 02:49:34 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 02:49:34 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')]} 02:49:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:49:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:34 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')]} 02:49:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:49:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:34 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:49:34 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 02:49:34 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 02:49:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:49:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:49:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:49:34 INFO - 'HOME': '/Users/cltbld', 02:49:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:49:34 INFO - 'LOGNAME': 'cltbld', 02:49:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:49:34 INFO - 'MOZ_NO_REMOTE': '1', 02:49:34 INFO - 'NO_EM_RESTART': '1', 02:49:34 INFO - 'PAGER': '/bin/cat', 02:49:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:49:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:49:34 INFO - 'PWD': '/builds/slave/test', 02:49:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:49:34 INFO - 'SHELL': '/bin/bash', 02:49:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:49:34 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:49:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:49:34 INFO - 'USER': 'cltbld', 02:49:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:49:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:49:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:49:34 INFO - 'XPC_FLAGS': '0x0', 02:49:34 INFO - 'XPC_SERVICE_NAME': '0', 02:49:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:49:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:49:35 INFO - Downloading/unpacking psutil>=3.1.1 02:49: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 02:49: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 02:49: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 02:49: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 02:49: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 02:49: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 02:49:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:49:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:49:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:49:38 INFO - Installing collected packages: psutil 02:49:38 INFO - Running setup.py install for psutil 02:49:38 INFO - building 'psutil._psutil_osx' extension 02:49:38 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 02:49:39 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 02:49:39 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 02:49:39 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 02:49:39 INFO - building 'psutil._psutil_posix' extension 02:49:39 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 02:49:39 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 02:49:39 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 02:49:39 INFO - ^ 02:49:39 INFO - 1 warning generated. 02:49:39 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 02:49:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:49:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:49:39 INFO - Successfully installed psutil 02:49:39 INFO - Cleaning up... 02:49:39 INFO - Return code: 0 02:49:39 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 02:49:39 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')]} 02:49:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:49:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:39 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')]} 02:49:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:49:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:39 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:49:39 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 02:49:39 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 02:49:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:49:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:49:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:49:39 INFO - 'HOME': '/Users/cltbld', 02:49:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:49:39 INFO - 'LOGNAME': 'cltbld', 02:49:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:49:39 INFO - 'MOZ_NO_REMOTE': '1', 02:49:39 INFO - 'NO_EM_RESTART': '1', 02:49:39 INFO - 'PAGER': '/bin/cat', 02:49:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:49:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:49:39 INFO - 'PWD': '/builds/slave/test', 02:49:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:49:39 INFO - 'SHELL': '/bin/bash', 02:49:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:49:39 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:49:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:49:39 INFO - 'USER': 'cltbld', 02:49:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:49:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:49:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:49:39 INFO - 'XPC_FLAGS': '0x0', 02:49:39 INFO - 'XPC_SERVICE_NAME': '0', 02:49:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:49:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:49:39 INFO - Downloading/unpacking mozsystemmonitor==0.3 02:49:39 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 02:49:39 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 02:49:39 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 02:49:39 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 02:49:39 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 02:49:39 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 02:49:42 INFO - Downloading mozsystemmonitor-0.3.tar.gz 02:49:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:49:42 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 02:49:42 INFO - Installing collected packages: mozsystemmonitor 02:49:42 INFO - Running setup.py install for mozsystemmonitor 02:49:42 INFO - Successfully installed mozsystemmonitor 02:49:42 INFO - Cleaning up... 02:49:42 INFO - Return code: 0 02:49:42 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 02:49:42 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')]} 02:49:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:49:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:42 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')]} 02:49:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:49:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:42 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:49:42 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 02:49:42 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 02:49:42 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:49:42 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:49:42 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:49:42 INFO - 'HOME': '/Users/cltbld', 02:49:42 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:49:42 INFO - 'LOGNAME': 'cltbld', 02:49:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:49:42 INFO - 'MOZ_NO_REMOTE': '1', 02:49:42 INFO - 'NO_EM_RESTART': '1', 02:49:42 INFO - 'PAGER': '/bin/cat', 02:49:42 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:49:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:49:42 INFO - 'PWD': '/builds/slave/test', 02:49:42 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:49:42 INFO - 'SHELL': '/bin/bash', 02:49:42 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:49:42 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:49:42 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:49:42 INFO - 'USER': 'cltbld', 02:49:42 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:49:42 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:49:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:49:42 INFO - 'XPC_FLAGS': '0x0', 02:49:42 INFO - 'XPC_SERVICE_NAME': '0', 02:49:42 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:49:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:49:42 INFO - Downloading/unpacking jsonschema==2.5.1 02:49:42 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 02:49:42 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 02:49:42 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 02:49:42 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 02:49:42 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 02:49:42 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 02:49:45 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:49:45 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 02:49:45 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 02:49:45 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 02:49:45 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 02:49:45 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 02:49:45 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 02:49:45 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 02:49:45 INFO - Downloading functools32-3.2.3-2.tar.gz 02:49:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:49:45 INFO - warning: no files found matching '*.txt' 02:49:45 INFO - no previously-included directories found matching 'build' 02:49:45 INFO - no previously-included directories found matching 'dist' 02:49:45 INFO - no previously-included directories found matching '.git*' 02:49:45 INFO - Installing collected packages: jsonschema, functools32 02:49:45 INFO - Running setup.py install for functools32 02:49:46 INFO - warning: no files found matching '*.txt' 02:49:46 INFO - no previously-included directories found matching 'build' 02:49:46 INFO - no previously-included directories found matching 'dist' 02:49:46 INFO - no previously-included directories found matching '.git*' 02:49:46 INFO - Successfully installed jsonschema functools32 02:49:46 INFO - Cleaning up... 02:49:46 INFO - Return code: 0 02:49:46 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 02:49:46 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')]} 02:49:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:49:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:46 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')]} 02:49:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:49:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:46 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:49:46 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 02:49:46 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 02:49:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:49:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:49:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:49:46 INFO - 'HOME': '/Users/cltbld', 02:49:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:49:46 INFO - 'LOGNAME': 'cltbld', 02:49:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:49:46 INFO - 'MOZ_NO_REMOTE': '1', 02:49:46 INFO - 'NO_EM_RESTART': '1', 02:49:46 INFO - 'PAGER': '/bin/cat', 02:49:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:49:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:49:46 INFO - 'PWD': '/builds/slave/test', 02:49:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:49:46 INFO - 'SHELL': '/bin/bash', 02:49:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:49:46 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:49:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:49:46 INFO - 'USER': 'cltbld', 02:49:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:49:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:49:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:49:46 INFO - 'XPC_FLAGS': '0x0', 02:49:46 INFO - 'XPC_SERVICE_NAME': '0', 02:49:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:49:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:49:46 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 02:49:46 INFO - Cleaning up... 02:49:46 INFO - Return code: 0 02:49:46 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:49:46 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')]} 02:49:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:49:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:46 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')]} 02:49:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:49:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:46 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:49:46 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 02:49:46 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 02:49:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:49:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:49:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:49:46 INFO - 'HOME': '/Users/cltbld', 02:49:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:49:46 INFO - 'LOGNAME': 'cltbld', 02:49:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:49:46 INFO - 'MOZ_NO_REMOTE': '1', 02:49:46 INFO - 'NO_EM_RESTART': '1', 02:49:46 INFO - 'PAGER': '/bin/cat', 02:49:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:49:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:49:46 INFO - 'PWD': '/builds/slave/test', 02:49:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:49:46 INFO - 'SHELL': '/bin/bash', 02:49:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:49:46 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:49:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:49:46 INFO - 'USER': 'cltbld', 02:49:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:49:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:49:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:49:46 INFO - 'XPC_FLAGS': '0x0', 02:49:46 INFO - 'XPC_SERVICE_NAME': '0', 02:49:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:49:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:49:46 INFO - Downloading/unpacking blobuploader==1.2.4 02:49: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 02:49: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 02:49: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 02:49: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 02:49: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 02:49: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 02:49:49 INFO - Downloading blobuploader-1.2.4.tar.gz 02:49:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:49:49 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:49:49 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 02:49:49 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 02:49:49 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 02:49:49 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 02:49:49 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 02:49:49 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 02:49:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:49:49 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:49:49 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 02:49:49 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 02:49:49 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 02:49:49 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 02:49:49 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 02:49:49 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 02:49:50 INFO - Downloading docopt-0.6.1.tar.gz 02:49:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:49:50 INFO - Installing collected packages: blobuploader, requests, docopt 02:49:50 INFO - Running setup.py install for blobuploader 02:49:50 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:49:50 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:49:50 INFO - Running setup.py install for requests 02:49:51 INFO - Running setup.py install for docopt 02:49:51 INFO - Successfully installed blobuploader requests docopt 02:49:51 INFO - Cleaning up... 02:49:51 INFO - Return code: 0 02:49:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:49: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')]} 02:49:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:49:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49: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')]} 02:49:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:49:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:51 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:49:51 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 02:49:51 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 02:49:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:49:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:49:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:49:51 INFO - 'HOME': '/Users/cltbld', 02:49:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:49:51 INFO - 'LOGNAME': 'cltbld', 02:49:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:49:51 INFO - 'MOZ_NO_REMOTE': '1', 02:49:51 INFO - 'NO_EM_RESTART': '1', 02:49:51 INFO - 'PAGER': '/bin/cat', 02:49:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:49:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:49:51 INFO - 'PWD': '/builds/slave/test', 02:49:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:49:51 INFO - 'SHELL': '/bin/bash', 02:49:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:49:51 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:49:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:49:51 INFO - 'USER': 'cltbld', 02:49:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:49:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:49:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:49:51 INFO - 'XPC_FLAGS': '0x0', 02:49:51 INFO - 'XPC_SERVICE_NAME': '0', 02:49:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:49:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:49:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:49:51 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-KIIzrH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:49:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:49:51 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-WP_FHm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:49:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:49:51 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-ZgI8X4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:49:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:49:51 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-rWlKLA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-4XQ1ji-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-jLsoa9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-_MEDyN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-sH577N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-5nlVfL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-AF3kpN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-Id3yKg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-iqCvCo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:49:52 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-DBjp2p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:49:53 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-3NOngz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:49:53 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-GhV7Hq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:49:53 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-jCvYPG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:49:53 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-PIeh_K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:49:53 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:49:53 INFO - Running setup.py install for manifestparser 02:49:53 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:49:53 INFO - Running setup.py install for mozcrash 02:49:53 INFO - Running setup.py install for mozdebug 02:49:53 INFO - Running setup.py install for mozdevice 02:49:54 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Running setup.py install for mozfile 02:49:54 INFO - Running setup.py install for mozhttpd 02:49:54 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Running setup.py install for mozinfo 02:49:54 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Running setup.py install for mozInstall 02:49:54 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Running setup.py install for mozleak 02:49:54 INFO - Running setup.py install for mozlog 02:49:54 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:49:54 INFO - Running setup.py install for moznetwork 02:49:55 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:49:55 INFO - Running setup.py install for mozprocess 02:49:55 INFO - Running setup.py install for mozprofile 02:49:55 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:49:55 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:49:55 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:49:55 INFO - Running setup.py install for mozrunner 02:49:55 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:49:55 INFO - Running setup.py install for mozscreenshot 02:49:55 INFO - Running setup.py install for moztest 02:49:55 INFO - Running setup.py install for mozversion 02:49:55 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:49:55 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:49:55 INFO - Cleaning up... 02:49:55 INFO - Return code: 0 02:49:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:49: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')]} 02:49:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:49:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49: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')]} 02:49:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:49:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:49:55 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:49:55 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 02:49:55 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 02:49:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:49:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:49:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:49:56 INFO - 'HOME': '/Users/cltbld', 02:49:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:49:56 INFO - 'LOGNAME': 'cltbld', 02:49:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:49:56 INFO - 'MOZ_NO_REMOTE': '1', 02:49:56 INFO - 'NO_EM_RESTART': '1', 02:49:56 INFO - 'PAGER': '/bin/cat', 02:49:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:49:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:49:56 INFO - 'PWD': '/builds/slave/test', 02:49:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:49:56 INFO - 'SHELL': '/bin/bash', 02:49:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:49:56 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:49:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:49:56 INFO - 'USER': 'cltbld', 02:49:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:49:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:49:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:49:56 INFO - 'XPC_FLAGS': '0x0', 02:49:56 INFO - 'XPC_SERVICE_NAME': '0', 02:49:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:49:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:49:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:49:56 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-4HcmXS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:49:56 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)) 02:49:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:49:56 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-nVPbZB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:49:56 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)) 02:49:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:49:56 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-VlwnWr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:49:56 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)) 02:49:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:49:56 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-VA1Sqb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:49:56 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)) 02:49:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:49:56 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-ut_UD4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:49:56 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)) 02:49:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:49:56 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-ifeMAp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:49:56 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)) 02:49:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:49:56 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-XS4IN8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-0gOS0G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-egGPUu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-eWXhiN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-cEqI1l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-r3VxAQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-Zefcef-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-1Rto4Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-iNvNQx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-5UlDei-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:49:57 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)) 02:49:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:49:57 INFO - Running setup.py (path:/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/pip-BYquP7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:49:58 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)) 02:49:58 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)) 02:49:58 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)) 02:49:58 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)) 02:49:58 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)) 02:49:58 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)) 02:49:58 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:49:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:49:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:49:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:49:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:49:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:49:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:50:00 INFO - Downloading blessings-1.6.tar.gz 02:50:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:50:00 INFO - Installing collected packages: blessings 02:50:00 INFO - Running setup.py install for blessings 02:50:00 INFO - Successfully installed blessings 02:50:00 INFO - Cleaning up... 02:50:00 INFO - Return code: 0 02:50:00 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:50:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:50:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:50:01 INFO - Reading from file tmpfile_stdout 02:50:01 INFO - Current package versions: 02:50:01 INFO - blessings == 1.6 02:50:01 INFO - blobuploader == 1.2.4 02:50:01 INFO - docopt == 0.6.1 02:50:01 INFO - functools32 == 3.2.3-2 02:50:01 INFO - jsonschema == 2.5.1 02:50:01 INFO - manifestparser == 1.1 02:50:01 INFO - mozInstall == 1.12 02:50:01 INFO - mozcrash == 0.17 02:50:01 INFO - mozdebug == 0.1 02:50:01 INFO - mozdevice == 0.48 02:50:01 INFO - mozfile == 1.2 02:50:01 INFO - mozhttpd == 0.7 02:50:01 INFO - mozinfo == 0.9 02:50:01 INFO - mozleak == 0.1 02:50:01 INFO - mozlog == 3.4 02:50:01 INFO - moznetwork == 0.27 02:50:01 INFO - mozprocess == 0.23 02:50:01 INFO - mozprofile == 0.28 02:50:01 INFO - mozrunner == 6.12 02:50:01 INFO - mozscreenshot == 0.1 02:50:01 INFO - mozsystemmonitor == 0.3 02:50:01 INFO - moztest == 0.7 02:50:01 INFO - mozversion == 1.4 02:50:01 INFO - psutil == 3.1.1 02:50:01 INFO - requests == 1.2.3 02:50:01 INFO - wsgiref == 0.1.2 02:50:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:50:01 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')]} 02:50:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:50:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:50:01 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')]} 02:50:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:50:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:50:01 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:50:01 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 02:50:01 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 02:50:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:50:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:50:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:50:01 INFO - 'HOME': '/Users/cltbld', 02:50:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:50:01 INFO - 'LOGNAME': 'cltbld', 02:50:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:50:01 INFO - 'MOZ_NO_REMOTE': '1', 02:50:01 INFO - 'NO_EM_RESTART': '1', 02:50:01 INFO - 'PAGER': '/bin/cat', 02:50:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:50:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:50:01 INFO - 'PWD': '/builds/slave/test', 02:50:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:50:01 INFO - 'SHELL': '/bin/bash', 02:50:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:50:01 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:50:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:50:01 INFO - 'USER': 'cltbld', 02:50:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:50:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:50:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:50:01 INFO - 'XPC_FLAGS': '0x0', 02:50:01 INFO - 'XPC_SERVICE_NAME': '0', 02:50:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:50:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 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)) 02:50:01 INFO - Cleaning up... 02:50:01 INFO - Return code: 0 02:50:01 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:50:01 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')]} 02:50:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:50:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:50:01 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')]} 02:50:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:50:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:50:01 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 0x10a3d0490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a346570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdbd2d8a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, '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.GBd97ieS8T/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.YrRjbt7CFG/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:50:01 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 02:50:01 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 02:50:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:50:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:50:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:50:01 INFO - 'HOME': '/Users/cltbld', 02:50:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:50:01 INFO - 'LOGNAME': 'cltbld', 02:50:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:50:01 INFO - 'MOZ_NO_REMOTE': '1', 02:50:01 INFO - 'NO_EM_RESTART': '1', 02:50:01 INFO - 'PAGER': '/bin/cat', 02:50:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:50:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:50:01 INFO - 'PWD': '/builds/slave/test', 02:50:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:50:01 INFO - 'SHELL': '/bin/bash', 02:50:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:50:01 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:50:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:50:01 INFO - 'USER': 'cltbld', 02:50:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:50:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:50:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:50:01 INFO - 'XPC_FLAGS': '0x0', 02:50:01 INFO - 'XPC_SERVICE_NAME': '0', 02:50:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:50:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:50:01 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 02:50:01 INFO - Cleaning up... 02:50:01 INFO - Return code: 0 02:50:01 INFO - Running post-action listener: _resource_record_post_action 02:50:01 INFO - Running post-action listener: _start_resource_monitoring 02:50:01 INFO - Starting resource monitoring. 02:50:01 INFO - [mozharness: 2016-10-23 09:50:01.814604Z] Finished create-virtualenv step (success) 02:50:01 INFO - [mozharness: 2016-10-23 09:50:01.815590Z] Running install step. 02:50:01 INFO - Running pre-action listener: _resource_record_pre_action 02:50:01 INFO - Running main action method: install 02:50:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:50:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:50:02 INFO - Reading from file tmpfile_stdout 02:50:02 INFO - Detecting whether we're running mozinstall >=1.0... 02:50:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:50:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:50:02 INFO - Reading from file tmpfile_stdout 02:50:02 INFO - Output received: 02:50:02 INFO - Usage: mozinstall [options] installer 02:50:02 INFO - Options: 02:50:02 INFO - -h, --help show this help message and exit 02:50:02 INFO - -d DEST, --destination=DEST 02:50:02 INFO - Directory to install application into. [default: 02:50:02 INFO - "/builds/slave/test"] 02:50:02 INFO - --app=APP Application being installed. [default: firefox] 02:50:02 INFO - mkdir: /builds/slave/test/build/application 02:50:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 02:50:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 02:50:35 INFO - Reading from file tmpfile_stdout 02:50:35 INFO - Output received: 02:50:35 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 02:50:35 INFO - Running post-action listener: _resource_record_post_action 02:50:35 INFO - [mozharness: 2016-10-23 09:50:35.062616Z] Finished install step (success) 02:50:35 INFO - [mozharness: 2016-10-23 09:50:35.062758Z] Running run-tests step. 02:50:35 INFO - Running pre-action listener: _resource_record_pre_action 02:50:35 INFO - Running main action method: run_tests 02:50:35 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 02:50:35 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 02:50:35 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 02:50:35 INFO - 2016-10-23 02:50:35.077 screenresolution[2018:24022] starting screenresolution argv=screenresolution get 02:50:35 INFO - 2016-10-23 02:50:35.079 screenresolution[2018:24022] Display 0: 1600x1200x32@60 02:50:35 INFO - 2016-10-23 02:50:35.085 screenresolution[2019:24025] starting screenresolution argv=screenresolution list 02:50:35 INFO - Available Modes on Display 0 02:50:35 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 02:50:35 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 02:50:35 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 02:50:35 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 02:50:35 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 02:50:35 INFO - Intel Iris: 02:50:35 INFO - Chipset Model: Intel Iris 02:50:35 INFO - Type: GPU 02:50:35 INFO - Bus: Built-In 02:50:35 INFO - VRAM (Dynamic, Max): 1536 MB 02:50:35 INFO - Vendor: Intel (0x8086) 02:50:35 INFO - Device ID: 0x0a2e 02:50:35 INFO - Revision ID: 0x0009 02:50:35 INFO - Displays: 02:50:35 INFO - Display: 02:50:35 INFO - Resolution: 1600 x 1200 @ 60 Hz 02:50:35 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 02:50:35 INFO - Display Serial Number: 1600x1200 60 02:50:35 INFO - Main Display: Yes 02:50:35 INFO - Mirror: Off 02:50:35 INFO - Online: Yes 02:50:35 INFO - Rotation: Supported 02:50:35 INFO - Return code: 0 02:50:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:50:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:50:35 INFO - Python 2.7.3 02:50:35 INFO - Return code: 0 02:50:35 INFO - grabbing minidump binary from tooltool 02:50: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')]} 02:50:35 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 0x10a1e4d30>, '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 0x10a04adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a1dcb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:50:35 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 02:50:35 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 02:50:35 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 02:50:35 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:50:35 INFO - Return code: 0 02:50:35 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 02:50:35 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:50:35 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:50:35 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 02:50:35 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:50:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0060', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 02:50:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0060 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 02:50:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GBd97ieS8T/Render', 02:50:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:50:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:50:35 INFO - 'HOME': '/Users/cltbld', 02:50:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:50:35 INFO - 'LOGNAME': 'cltbld', 02:50:35 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:50:35 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 02:50:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:50:35 INFO - 'MOZ_NO_REMOTE': '1', 02:50:35 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:50:35 INFO - 'NO_EM_RESTART': '1', 02:50:35 INFO - 'PAGER': '/bin/cat', 02:50:35 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:50:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:50:35 INFO - 'PWD': '/builds/slave/test', 02:50:35 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:50:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:50:35 INFO - 'SHELL': '/bin/bash', 02:50:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.YrRjbt7CFG/Listeners', 02:50:35 INFO - 'TMPDIR': '/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/', 02:50:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:50:35 INFO - 'USER': 'cltbld', 02:50:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:50:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:50:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:50:35 INFO - 'XPC_FLAGS': '0x0', 02:50:35 INFO - 'XPC_SERVICE_NAME': '0', 02:50:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:50:35 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0060', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 02:50:35 INFO - mozversion application_buildid: 20161023004025 02:50:35 INFO - mozversion application_changeset: 96ca0ecdcfa7b14cab40e8c7a0a4d97441652a79 02:50:35 INFO - mozversion application_display_name: FirefoxDeveloperEdition 02:50:35 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:50:35 INFO - mozversion application_name: Firefox 02:50:35 INFO - mozversion application_remotingname: firefox-dev 02:50:35 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 02:50:35 INFO - mozversion application_vendor: Mozilla 02:50:35 INFO - mozversion application_version: 51.0a2 02:50:35 INFO - mozversion platform_buildid: 20161023004025 02:50:35 INFO - mozversion platform_changeset: 96ca0ecdcfa7b14cab40e8c7a0a4d97441652a79 02:50:35 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 02:50:35 INFO - mozversion platform_version: 51.0a2 02:50:35 INFO - using testdate: 1477216235 02:50:35 INFO - actual date: 1477216235 02:50:35 INFO - starting webserver on 'localhost:52676' 02:50:35 INFO - SUITE-START | Running 2 tests 02:50:35 INFO - TEST-START | dromaeo_css 02:50:35 INFO - operating with platform_type : mac_ 02:50:35 INFO - Initialising browser for dromaeo_css test... 02:50:35 INFO - TEST-INFO | started process 2029 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/tmpRGtZth/profile http://localhost:52676/getInfo.html) 02:50:38 INFO - PROCESS | 2029 | __metrics Screen width/height:1600/1200 02:50:38 INFO - PROCESS | 2029 | colorDepth:24 02:50:38 INFO - PROCESS | 2029 | Browser inner width/height: 1024/689 02:50:38 INFO - PROCESS | 2029 | __metrics 02:50:38 INFO - PROCESS | 2029 | 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" 02:50:38 INFO - PROCESS | 2029 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 02:50:38 INFO - TEST-INFO | 2029: exit 0 02:50:38 INFO - Browser initialized. 02:50:38 INFO - Running cycle 1/1 for dromaeo_css test... 02:50:38 INFO - TEST-INFO | started process 2033 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/tmpRGtZth/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:50:50 INFO - PROCESS | 2033 | RSS: Main: 219533312 02:50:50 INFO - PROCESS | 2033 | 02:51:41 INFO - PROCESS | 2033 | 1477216301820 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] 02:53:53 INFO - PROCESS | 2033 | Cycle 1(1): loaded http://localhost:52676/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52676/tests/dromaeo/cssquery-ext.html) 02:53:55 INFO - PROCESS | 2033 | RSS: Main: 356438016 02:53:55 INFO - PROCESS | 2033 | 02:56:58 INFO - PROCESS | 2033 | Cycle 1(1): loaded http://localhost:52676/tests/dromaeo/cssquery-ext.html (next: http://localhost:52676/tests/dromaeo/cssquery-jquery.html) 02:56:58 INFO - PROCESS | 2033 | RSS: Main: 352813056 02:56:58 INFO - PROCESS | 2033 | 03:00:01 INFO - PROCESS | 2033 | Cycle 1(1): loaded http://localhost:52676/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52676/tests/dromaeo/cssquery-mootools.html) 03:00:01 INFO - PROCESS | 2033 | RSS: Main: 335106048 03:00:01 INFO - PROCESS | 2033 | 03:03:04 INFO - PROCESS | 2033 | Cycle 1(1): loaded http://localhost:52676/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52676/tests/dromaeo/cssquery-prototype.html) 03:03:04 INFO - PROCESS | 2033 | RSS: Main: 328654848 03:03:04 INFO - PROCESS | 2033 | 03:06:08 INFO - PROCESS | 2033 | Cycle 1(1): loaded http://localhost:52676/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52676/tests/dromaeo/cssquery-yui.html) 03:06:08 INFO - PROCESS | 2033 | RSS: Main: 311459840 03:06:08 INFO - PROCESS | 2033 | 03:09:11 INFO - PROCESS | 2033 | Cycle 1(1): loaded http://localhost:52676/tests/dromaeo/cssquery-yui.html (next: http://localhost:52676/tests/dromaeo/cssquery-dojo.html) 03:09:11 INFO - PROCESS | 2033 | RSS: Main: 422256640 03:09:11 INFO - PROCESS | 2033 | 03:09:11 INFO - PROCESS | 2033 | __start_tp_report 03:09:11 INFO - PROCESS | 2033 | _x_x_mozilla_page_load 03:09:11 INFO - PROCESS | 2033 | _x_x_mozilla_page_load_details 03:09:11 INFO - PROCESS | 2033 | |i|pagename|runs| 03:09:11 INFO - PROCESS | 2033 | |0;dojo.html;3283.6716328367165;3289.42435073862;3294.670532946705;3314.038928710674;3345.8159801210923;5551.583631227659;5587.106063029916;5601.439856014396;5617.129344951529;5635.492805647491;5503.862403439916;5585.748641311141;5594.9089927464165;5597.188407680894;5633;5083.847484575459;5104.3619547556555;5129.769160387773;5169.638125331228;5216.60875434344;5121.743912804363;5138.511841375082;5206.401263854667;5206.5834733221445;5227.189785583221;5114.820981265657;5185.325907632021;5222;5223.347081614798;5225.973870130644;5129.6409251352425;5132.435432102466;5138.486151384869;5146.511081447256;5151.948480515184;5099.15863882459;5145.614078944094;5163.32876726027;5175.792968281265;5193.8961220775755;5460.945390546083;5494.697791621459;5498.5876059295315;5578.63738856973;5600.019996500637;5967.6419414835245;6033.396660333975;6058.818235452944;6075.848103797396;6094.8781024379705;6104.08438734189;6166.630002199882;6173.506119510428;6186.10301506279;6211.596246244025;4825.638077144228;5529.0324193266015;5591.9720401397735;5658.12299093637;5658.858528536737;6198.287196972406;6229.50163986889;6241.095041218998;6280.654563998933;6321.336259692666;5982.312034116046;5996.760129594854;5998.190244317048;5998.310194327708;6028.095785632103;6009.489193418521;6132.5707200495535;6153.2616086069065;6163.229596300463;6180.381961803783;5913.290405151323;5956.702164891738;5959.986802243629;6001.489873360726;6030.27636683592;6107.219158344477;6118.687799483981;6124.565059171925;6136.815895523141;6146.815595532141;4840.443349014909;4844.346013288161;4848.854534363974;4867.829625963074;4870.14772414826;4258.659307255412;4277.786110694453;4322.524522302544;4327.134573085333;4341.9131617367475;5543.501084902378;5578.609497335147;5613.46672066153;5614.6631202128;5615.943840561542;6122.601731493672;6123.465646421124;6144.818589400698;6156.476699480594;6186.752529898844;5634.887302253932;5643.492085712305;5647.322321321468;5650;5654.830355089354;5161.870953226125;5231.1891656792495;5236.450172731885;5251.133562962068;5251.1598144297495;6299.244090709144;6303.842403939938;6338.397852204218;6341.4609758170145;6350.174477318012;6155.230596175478;6155.784547540815;6165.475934545614;6176.28972668131;6189.473894718999;6203.534734894811;6252.09344645033;6268.902941985226;6272.153259309935;6298.590591611531;5981.162637230704;6010.128531363015;6032.909506357496;6091.238595175603;6124.5406594506485;6120.642498383738;6143.170671959407;6147.815565533041;6178.721957511832;6180;5810.5351571875;5906.26171728534;5976.282846058501;5989.191459153133;6001.159837622824;4688;5783.074708046693;5868.178455016216;5872.765089396376;5901.203337549376;5789.421057894177;5798.159266906359;5799.739011744397;5807.186993820784;5814.854628634318;5949.524038076857;5978.491828194652;5982.012967860428;5983.521318294439;5984.012637914695;5602.607817452739;5706.914396283976;5721.485066344049;5733.512651424676;5772.826815195551 03:09:11 INFO - PROCESS | 2033 | |1;ext.html;469.1555200638849;478.6218887079207;491.45448552107155;517.8575891629799;523.1995047577208;25252.494950100987;31284.843575782117;40432.98917527063;41845.16309673805;42052;41172.58827411733;43816;44028.33957490632;44079.33880991788;44102.55897441025;9780.65767698129;9981.550830212622;9992.75018124549;9998.10017098461;10008.049235322633;8817.603207855662;9068.322360363321;12003.699907502294;12262.448189831435;12299.385030748426;12231.021518278561;12268.202566833172;12293.078019148556;12331.198472099284;12343.382830858465;8881.822363552692;12239.510419583206;12315.630531083993;12332.136750427473;12344.876551234462;8807.603657835412;9039.54802259891;9040.502772347518;9042.909570904272;11848.111391645662;38835;41795.58204417947;41887.58112418867;41887.7905610473;41947.7902610488;3360.24394511233;3454.2573346730323;3577.4276115821604;3938.9015274618077;4024.2366544690076;30328.393432131455;30613.540796888065;31909;32106.197345066328;32848.3430331392;3113.112762862573;3226.6450690424035;3250.236194494292;3265.5264986576813;3386.4243078676436;408461;495921;495960;496171;498073;60840.69579652073;61205;61275;61364.38635613676;61427;64627.67686161539;64829;64883;64968;65041.34958650353;16793.83206167947;17032.31870725182;17063.232154553076;17071.402500912656;17095.829041709672;11853.111016673784;12144.392780360946;13213.33933303331;13283.468661253635;13285;15121.697566048837;15216.619584510254;15230.314635841414;15243.923780381027;16820.495385138467;5569.359523654751;6405.19935008124;6445.903311450332;6451.1936007999;6469.026946781277;881.8589025755848;949.6486300068881;967.434051080126;1096.2600244834864;1110.9611163609236;29870.40259194804;30140;30375;30658.080257592308;30703.539446908315;1076.6931424543968;1110.8333749937574;1139.7777433400408;1140.9828852567218;1158.530795028015;15305.761577198866;15608.453704120528;15928.276879964571;16068.678626427405;16123.435679751386;592046;596679.0166049142;598404;599364;600287;50251;51082.23376649353;51397.48602514002;57934;59178;1345.4416417186953;1375.339836878304;1392.2899321346185;1401.4534331610885;1407.7888316752365;25632.74367256378;29746.85126574353;30621.387572247986;31455.528167077053;31674;51495.97008059743;55660;57206.71396643157;57301.713491432274;60443.69778151081;630012;635308;653001;654915;863948;25561;25726.742732572435;25824.741752582235;26070.34824129336;26076.34809129711;38566.035849102875;46059;46115;46404.07191856211;46800.531994679615;37497.437538437494;38126.80936595299;38169.23661526809;38229.235415292096;38395.80802095972;36660.633393665725;38022.44380363413;38067;38563.65027224034;39746.60253397429;37707.11464426713;38232.80883595564;38325.61674383221;38489.615103848606;38511.61488385192;29195.270118247212;31772.364552709278;32164.35671286608;34566;34717.652823472454;19270.421887343404;25387.36531586725;25489.107881224067;25938.61092083658;26037 03:09:12 INFO - PROCESS | 2033 | |2;jquery.html;319.7010794906762;341.6719948849105;356.31765169700026;379.8100949525236;405.9898502537436;11830.881691183085;14792.852071479281;15439.536813895573;16860.156992150372;20168.294109706163;19163.712544311813;20294;20690.896545517287;20949.68575471369;20964.26625068123;5784.2480477537965;6118.847028824271;6122.387761223887;6127.448529632332;6131.417515336036;4639.396878405802;6009.308929473101;6439.5170362223025;6918.169819621652;7023.4381249500175;6629.33706629338;6840.002593555012;6912.239653638096;6923;6934.167899851999;5760.74076666551;6757.898631520531;6786.524943253974;6800.047993280945;6824.727010919582;5658.207850900877;5849.415058494159;5872.412758724136;5918.526517878602;5928.940710592882;25475;25924.74075259242;25967;26156.776673982735;26323.73676263232;2344.10923848938;2433.9634905476432;2465.4083020075054;2503.8873250703764;2525.01524405482;14192.432302707879;15792.605184870356;15949.44176953801;16372.918135409365;16436.096014719187;1854.7032474803966;1856.2946080489328;1957.109515170594;1969.5765410436825;2005.769336526289;114355.85644143535;123298.38350808188;127880.3605981964;130334.34832825775;133144;11301.039411649937;11481;11535.8269625954;11544.826827597593;11768.235064720766;14614.63463413402;14635.97548171639;14650.901182411362;14661.85338146605;14663.926680366743;8423;8599.495088359512;8658.220760131619;8753.562321883881;8812.911870881337;7210.567365958059;7314.524555903849;7357.926420735831;8713.390062695551;8732.345074119467;4399.230134726474;4487.820487180542;4489.483709373464;4564.543545645409;4586.197415452282;1423.7508436023654;1825.6996184806974;1838.4576549917806;1862.919506686119;1880.0411789987204;779.9743337511155;879.6921077622909;911.148076548416;968.9854652180223;974.3131092579856;20626.484337891372;21138;21154.471138221666;21197.78802211958;21206.78793212079;941.9873635841361;943.4339396362265;965.4882912056621;987.5013118375318;995.7411073120896;9254.722358329262;11059.336439813636;11074;11192.552297907992;11247.606333778278;592030;594001;603676;610415;614605;103851.56838640671;113091;114158;117382.41308793401;140579;923.7967647117623;953.7710949372239;993.144708961735;993.7293284844241;997.0179373317277;18677.252909883453;18684;19002.52493687669;19015.619687606446;19146.904265478584;39759.2048159041;48360;50765.49234507755;51694.74152629213;51772.482275176764;75309.87035194367;83517.58241208755;83567.58216209123;85915;86556.56721716603;6376.649284289409;7397.445191610758;7557.622118894144;8004;8410.285125764378;9284.118008789153;12229.449674764835;12806.103572749818;13148.474061037834;13166.210027398387;10834.729131771768;11031;11133.332000080021;11136.610218642309;11263.26788758728;10592.470376480991;10713.732156696145;10937.726556835825;11066.612668556561;11165.553377864795;8916.955415222883;8984.46093234408;11285.266457680225;11583.826242606536;11586.188966772244;7981.521108733495;8052.510285596949;8164.142765009588;8369.455985360932;8390.035145958293;10534.104601108686;10862.837057443987;11131.387773672526;11141.944290278496;11242.718932026764 03:09:12 INFO - PROCESS | 2033 | |3;mootools.html;1410.6050305914343;1513.7577987521995;1705.4457301377047;1883.256113835036;1926.4220733779862;7912.564808935506;8183.42716009878;8578.74263772087;9141.908580914198;9144.908550914497;8014.358851291897;8659.134086591337;8854.690085846996;8885.600147993357;8978.775530611721;2396.604560247557;2431.963520547193;2432.85402875828;2437.683101196842;2438.670779444779;2117.14255726431;2205.823534117275;2402.939926501834;2422.39440139965;2445.4497738008986;2176.1295481807247;2203.250894695811;2203.94490137747;2351.5884720173985;2419;2027.9493012674654;2402.423418379594;2409.542186984467;2412.19191570824;2415.6738840256694;2371.8102551795814;2415.082268737886;2418.6372044193336;2419.7701218384227;2421.1404951242407;8807.691730789391;9023.09769023099;9028.638854445815;9037.819243615091;9058.547072646406;5256.26412302278;5410.810621628224;5414.972925135349;5436.3476382833915;5438.966596346681;3515.34966031285;3584.534010578634;3697.371446854041;3697.593264740903;3701.777893326382;1090.1769164280997;1091.3560999010542;1091.579741799405;1107.224942540217;1117.0951529261324;11819.881801181964;11981.101417393731;12004.399780011052;12017;12027.699307517294;4790.640701947368;4800.543948324974;4803.543663352046;4898.363212782316;4927.704337739747;10174;10179.9491002546;10191.796164076677;10192.439415832201;10194.694159175087;5449.373322067933;5456.099743542271;5457.426970168154;5461.2627295315415;5468.699221542854;4852.126617208936;4933.975330123327;4934.55588996992;4986.576141027981;4987.950120498748;3983.223271462095;3986.940195897064;4036.002178921394;4092.2224777292217;4093.959060409358;1291.9870801291868;1298.8701129886936;1302.3423171298434;1323.9867601324056;1326.78771396578;638.7987783848073;791.5092642561649;885.5306687455659;941.2234906202274;952.9857052144223;5095.847124586268;5916.3787802281;5969.253843269591;6073.75704971805;6170.629762214281;928.1321963963716;956.8660387545749;958.5494817435793;964.8793900762405;995.0447570332417;3916.3538016227003;4065.654419374386;4095.815688294034;4147.212029714345;4173.97913010433;10638.202134839763;11044.779104417867;11076.446177691083;11089.778204436028;11094.833577496343;9350;11006.834897476545;11016.228863979444;11019.83470247947;11021;7957.920420795834;8300.83398332042;8360.540170290693;8373.49759014461;8387.496750194885;5990.7903223386975;6109.144719739329;6131.957567213673;6148.538859585459;6160.229971253593;10157.085862272135;10393.480325983823;10396.896031039592;10403.479826008821;10417.895821041995;10119.342242754197;10434.321769084985;10570.942905709675;10590.629327973484;10597.41714205726;7553.357964573072;7677.155512893689;7684.346830519468;7692.34615057704;7703.499272547267;8354.206350396702;8455.239028487465;8501.87247191305;8568.828623427622;8578.270846978077;7531.774046778605;7664.923350766421;7680.846383072419;7709.922900771145;7742.303192712683;6489.1888513935755;7434.145073316421;7441.739539116105;7525.285097915908;7657.119431265253;7025.297470252934;7076.893846592408;7190.568565886064;7205;7215.314545118205;4898.4121905371585;5064.215046667772;5141.511556402136;5207.1668533034535;5357.571394288369;5082.4409314976065;5120.462351453193;5220.634555581073;5246.265522826731;5372.892542149213 03:09:12 INFO - PROCESS | 2033 | |4;prototype.html;298.64908732239616;301.45135852748007;307.75379696243004;315.62283071729263;318.17751113371935;5322.494363035516;5335.733213339327;5373.5969802264835;5379.650322729025;5387.353517577886;4984.800607975677;5054.418741844689;5178.4821517848195;5182.248573956774;5219;3996.960030399702;4002.5597184309704;4017.096153365484;4028.375601781714;4036.9394459083137;4004.3181863617206;4016.53809811871;4051.6758659307334;4063.2889244382263;4067.434037895402;3290.720288775457;3889.835883612143;4026.5973402659647;4027.341954310156;4109.773962432065;3519.472079188117;4019.256437559061;4024.1951609678035;4038.5961403859524;4051.39229115635;3218.871245150191;3242.7243684286864;3350.0619826448633;3519.4017017107153;3547.840347184383;4512.210363186462;4883.898724310053;4997.400311962551;5120;5163;3467.630286037001;4591.449026116888;4610.193216187187;4665.743384113873;4711.528847115295;4802.687825291345;5346;5510.1459273812625;5527.55779537636;5550.833474995757;3230.9030729078167;3671.898430470848;3862.304785138674;3869.361555343365;3899.3566061599804;4880.609551235928;5089.898202035939;5791.88416231673;5844.620099693507;5950.7322170502;3785.337565925952;3799.6200379961783;3836.6738827199442;3837.6929845612285;3879.553851307079;3563.0914116900026;3588.8385022674042;3603.279344131184;3650;3886.7279290449965;4408.074304396048;4440.82643720069;4495.797689103998;4508.954910450853;4544.931826022612;5570.749316280777;5594.776208951596;5597.132444471114;5602.4957753802355;5610.663360198401;1224.13086708438;1249.1568191470722;1291.6964513339358;1325.3969443903002;1325.5228117877557;752.9887051694229;861.9655213791503;885.7696998780364;892.5849479991834;897.7441429192648;4568.520305367889;5247;5257.395399529027;5263.7894484220205;5281.973590132025;4989.3264409305;5514.4886885465985;5588.860278492989;5607.719614019283;5707.200991861143;3996.120853412303;4774.427068751772;5192.688438693691;5240.816571419982;5266.8419947401635;2446.47400808827;2945.23423909785;2965.4365670522534;2971.5884954646804;2987.848748900831;5405;5409.594280428983;5765.164051212634;5851.707414629252;5902.90097698703;4813.7593120343845;5078.704930242764;5443.03354671697;5673.914781357416;5828;5764.394738552392;5769.68266745333;5800.854978625483;5841.620294680833;5843.357230704619;4715.976420117878;4938.728369939688;5491.972540137273;5581.441855814386;5623.3814280428305;5589.664620122806;5604.607677462538;5608.4111168326735;5619.185218143264;5631.211630371833;5399.568034557305;5774.8055738818975;5815.883682326415;5839.708014599338;5890.586259297824;3198.8400579971376;3221.4523531000254;3767.114728038854;3767.2842159989514;3797.9430308544843;4288.678349123766;5175.948240517697;5259.658122222043;5637.295338082739;5683.090705487102;5020.322256495472;5290.418054013979;5488.945110548843;5492.752826122754;5509;4604.802751284623;4795.352627395257;5375.500392317591;5392.245085688085;5408.405075441777;4490.528494508029;5170.870728231825;5349.5495405464035;5398.325209348832;5405.972970135124;5141.665791723526;5219.530242278061;5392.784288628411;5394.2987411637805;5407.540359069523;4852.228936438245;5515.283013208417;5533.3083364579425;5539.750711217925;5554.305711786027 03:09:12 INFO - PROCESS | 2033 | |5;yui.html;723.8516104198638;725.4776560876168;768.1166658342905;774.554631087125;826.5164878546052;14990.700185996287;16328.673426531463;16377.83622163778;16381.83618163818;16395.59011024725;14726.190059546721;14853.628659283497;14859.331330090145;14868.107913525197;14876.62808429787;678.6708446403491;705.1643802094509;707.0172460280214;862.2799962031711;863.9222469977701;882.2104216726026;882.2500874256863;892.8839250897374;895.243519226256;899.0784445942928;935.7333160049387;942.6135284533343;943.1747221181466;945.9716208513755;948.9620415183384;729.3253740290211;931.1759093202497;931.9906800931972;935.1303287942211;942.9717108486757;556.4352182534731;556.9331680198402;559.4880684173976;561.3544423912492;675.9188897332302;14909.776353354708;15357;15363.308651110727;15363.615909602238;15373;13855.307234638227;14052.789208161887;14093.365798539091;14121.717565648732;14345.497907573184;12148.878511214863;12352.07359448036;12406.62780116598;12618.68453288666;12972.221666700028;4198.727082739612;4342.761148136851;4577.771111444415;4587.4953755087245;4711.0342379812055;103022.48488757583;107123;107599.92400076055;110648.89351106467;118693.99999999914;10318.587256509805;10851.891481085087;11070.612528561462;11354.432278386048;11422.485988130555;20217.696734548994;20805.271815486387;21026.789732102483;21196;21224.575508490052;7702.961485192538;7781.221877812287;7823.882641760378;7827.060752709597;7981;4339.262325404688;4410.184115938561;4464.464264288306;4470.396496472999;4561.521040290788;3412.4710669846213;3534.8055856928117;3540.760733743169;3547.467879818048;3552.4138517144384;622.9875402491925;640.7693230437039;652.3346186889346;657.7763560389395;663.3764261594087;515.6081378152631;570.520762559452;595.3391735173954;602.3223873142714;623.554158776477;7740.496867703581;7887.645055972495;8371.539565323965;8784.560771961376;8854.981677107085;545.312905738772;592.8043745563954;602.457787990803;603.477991537317;633.2432742872223;4143.4199212110325;4209.789510524462;4241.575842415796;4297.474396589166;4370.344448332712;96695.51652241693;156458.21770891073;160313;162642;170663;119388;120302;121918;133683.995353314;140922;68118;70207;102554;104014;113706;9393.953030235078;10009;10080.69757907264;10100.545475453475;10132.746681333025;63729.681351592946;63998.04002939867;65014;65647.34352656604;65687;94598;96895.51552242193;97823.51088244798;97900.51049744706;98423.50788246012;12728.109032368016;12744.808827867404;12922.320098387525;13079.869201307865;13571.524996625465;14438.494652687106;14838.77741833895;14900.32948517341;14912.62718432048;14921.552353429415;13374.866251337362;13520.12119212248;13670.043096983116;13878.424444499658;13950.023498355424;13963.092398994033;13972;14018.78971815444;14040;14041.719165616834;13508.257045862572;13620.795688064489;13632.386542605409;13637.38631761593;13698.863011370157;10868.402237876677;11249.100071994384;11352.829707554229;11707.121965852424;11822.763544729229;10241.724587099381;10649.574017039542;10651.467426628482;11404.258723182966;11600.361980091177 03:09:12 INFO - PROCESS | 2033 | __end_tp_report 03:09:12 INFO - PROCESS | 2033 | __start_cc_report 03:09:12 INFO - PROCESS | 2033 | _x_x_mozilla_cycle_collect,1321 03:09:12 INFO - PROCESS | 2033 | __end_cc_report 03:09:12 INFO - PROCESS | 2033 | __startTimestamp1477217351993__endTimestamp 03:09:12 INFO - PROCESS | 2033 | 03:09:12 INFO - PROCESS | 2033 | ------- Summary: start ------- 03:09:12 INFO - PROCESS | 2033 | Number of tests: 6 03:09:12 INFO - PROCESS | 2033 | 03:09:12 INFO - PROCESS | 2033 | [#0] dojo.html Cycles:165 Average:5628.67 Median:5789.42 stddev:633.55 (10.9%) stddev-sans-first:608.20 03:09:12 INFO - PROCESS | 2033 | Values: 3283.7 3289.4 3294.7 3314.0 3345.8 5551.6 5587.1 5601.4 5617.1 5635.5 5503.9 5585.7 5594.9 5597.2 5633.0 5083.8 5104.4 5129.8 5169.6 5216.6 5121.7 5138.5 5206.4 5206.6 5227.2 5114.8 5185.3 5222.0 5223.3 5226.0 5129.6 5132.4 5138.5 5146.5 5151.9 5099.2 5145.6 5163.3 5175.8 5193.9 5460.9 5494.7 5498.6 5578.6 5600.0 5967.6 6033.4 6058.8 6075.8 6094.9 6104.1 6166.6 6173.5 6186.1 6211.6 4825.6 5529.0 5592.0 5658.1 5658.9 6198.3 6229.5 6241.1 6280.7 6321.3 5982.3 5996.8 5998.2 5998.3 6028.1 6009.5 6132.6 6153.3 6163.2 6180.4 5913.3 5956.7 5960.0 6001.5 6030.3 6107.2 6118.7 6124.6 6136.8 6146.8 4840.4 4844.3 4848.9 4867.8 4870.1 4258.7 4277.8 4322.5 4327.1 4341.9 5543.5 5578.6 5613.5 5614.7 5615.9 6122.6 6123.5 6144.8 6156.5 6186.8 5634.9 5643.5 5647.3 5650.0 5654.8 5161.9 5231.2 5236.5 5251.1 5251.2 6299.2 6303.8 6338.4 6341.5 6350.2 6155.2 6155.8 6165.5 6176.3 6189.5 6203.5 6252.1 6268.9 6272.2 6298.6 5981.2 6010.1 6032.9 6091.2 6124.5 6120.6 6143.2 6147.8 6178.7 6180.0 5810.5 5906.3 5976.3 5989.2 6001.2 4688.0 5783.1 5868.2 5872.8 5901.2 5789.4 5798.2 5799.7 5807.2 5814.9 5949.5 5978.5 5982.0 5983.5 5984.0 5602.6 5706.9 5721.5 5733.5 5772.8 03:09:12 INFO - PROCESS | 2033 | 03:09:12 INFO - PROCESS | 2033 | [#1] ext.html Cycles:180 Average:71875.56 Median:38096.90 stddev:159791.10 (419.4%) stddev-sans-first:160149.41 03:09:12 INFO - PROCESS | 2033 | Values: 469.2 478.6 491.5 517.9 523.2 25252.5 31284.8 40433.0 41845.2 42052.0 41172.6 43816.0 44028.3 44079.3 44102.6 9780.7 9981.6 9992.8 9998.1 10008.0 8817.6 9068.3 12003.7 12262.4 12299.4 12231.0 12268.2 12293.1 12331.2 12343.4 8881.8 12239.5 12315.6 12332.1 12344.9 8807.6 9039.5 9040.5 9042.9 11848.1 38835.0 41795.6 41887.6 41887.8 41947.8 3360.2 3454.3 3577.4 3938.9 4024.2 30328.4 30613.5 31909.0 32106.2 32848.3 3113.1 3226.6 3250.2 3265.5 3386.4 408461.0 495921.0 495960.0 496171.0 498073.0 60840.7 61205.0 61275.0 61364.4 61427.0 64627.7 64829.0 64883.0 64968.0 65041.3 16793.8 17032.3 17063.2 17071.4 17095.8 11853.1 12144.4 13213.3 13283.5 13285.0 15121.7 15216.6 15230.3 15243.9 16820.5 5569.4 6405.2 6445.9 6451.2 6469.0 881.9 949.6 967.4 1096.3 1111.0 29870.4 30140.0 30375.0 30658.1 30703.5 1076.7 1110.8 1139.8 1141.0 1158.5 15305.8 15608.5 15928.3 16068.7 16123.4 592046.0 596679.0 598404.0 599364.0 600287.0 50251.0 51082.2 51397.5 57934.0 59178.0 1345.4 1375.3 1392.3 1401.5 1407.8 25632.7 29746.9 30621.4 31455.5 31674.0 51496.0 55660.0 57206.7 57301.7 60443.7 630012.0 635308.0 653001.0 654915.0 863948.0 25561.0 25726.7 25824.7 26070.3 26076.3 38566.0 46059.0 46115.0 46404.1 46800.5 37497.4 38126.8 38169.2 38229.2 38395.8 36660.6 38022.4 38067.0 38563.7 39746.6 37707.1 38232.8 38325.6 38489.6 38511.6 29195.3 31772.4 32164.4 34566.0 34717.7 19270.4 25387.4 25489.1 25938.6 26037.0 03:09:12 INFO - PROCESS | 2033 | 03:09:12 INFO - PROCESS | 2033 | [#2] jquery.html Cycles:180 Average:35168.66 Median:13321.72 stddev:100591.70 (755.1%) stddev-sans-first:100839.85 03:09:12 INFO - PROCESS | 2033 | Values: 319.7 341.7 356.3 379.8 406.0 11830.9 14792.9 15439.5 16860.2 20168.3 19163.7 20294.0 20690.9 20949.7 20964.3 5784.2 6118.8 6122.4 6127.4 6131.4 4639.4 6009.3 6439.5 6918.2 7023.4 6629.3 6840.0 6912.2 6923.0 6934.2 5760.7 6757.9 6786.5 6800.0 6824.7 5658.2 5849.4 5872.4 5918.5 5928.9 25475.0 25924.7 25967.0 26156.8 26323.7 2344.1 2434.0 2465.4 2503.9 2525.0 14192.4 15792.6 15949.4 16372.9 16436.1 1854.7 1856.3 1957.1 1969.6 2005.8 114355.9 123298.4 127880.4 130334.3 133144.0 11301.0 11481.0 11535.8 11544.8 11768.2 14614.6 14636.0 14650.9 14661.9 14663.9 8423.0 8599.5 8658.2 8753.6 8812.9 7210.6 7314.5 7357.9 8713.4 8732.3 4399.2 4487.8 4489.5 4564.5 4586.2 1423.8 1825.7 1838.5 1862.9 1880.0 780.0 879.7 911.1 969.0 974.3 20626.5 21138.0 21154.5 21197.8 21206.8 942.0 943.4 965.5 987.5 995.7 9254.7 11059.3 11074.0 11192.6 11247.6 592030.0 594001.0 603676.0 610415.0 614605.0 103851.6 113091.0 114158.0 117382.4 140579.0 923.8 953.8 993.1 993.7 997.0 18677.3 18684.0 19002.5 19015.6 19146.9 39759.2 48360.0 50765.5 51694.7 51772.5 75309.9 83517.6 83567.6 85915.0 86556.6 6376.6 7397.4 7557.6 8004.0 8410.3 9284.1 12229.4 12806.1 13148.5 13166.2 10834.7 11031.0 11133.3 11136.6 11263.3 10592.5 10713.7 10937.7 11066.6 11165.6 8917.0 8984.5 11285.3 11583.8 11586.2 7981.5 8052.5 8164.1 8369.5 8390.0 10534.1 10862.8 11131.4 11141.9 11242.7 03:09:12 INFO - PROCESS | 2033 | 03:09:12 INFO - PROCESS | 2033 | [#3] mootools.html Cycles:180 Average:5827.77 Median:4930.84 stddev:3270.12 (66.3%) stddev-sans-first:3262.44 03:09:12 INFO - PROCESS | 2033 | Values: 1410.6 1513.8 1705.4 1883.3 1926.4 7912.6 8183.4 8578.7 9141.9 9144.9 8014.4 8659.1 8854.7 8885.6 8978.8 2396.6 2432.0 2432.9 2437.7 2438.7 2117.1 2205.8 2402.9 2422.4 2445.4 2176.1 2203.3 2203.9 2351.6 2419.0 2027.9 2402.4 2409.5 2412.2 2415.7 2371.8 2415.1 2418.6 2419.8 2421.1 8807.7 9023.1 9028.6 9037.8 9058.5 5256.3 5410.8 5415.0 5436.3 5439.0 3515.3 3584.5 3697.4 3697.6 3701.8 1090.2 1091.4 1091.6 1107.2 1117.1 11819.9 11981.1 12004.4 12017.0 12027.7 4790.6 4800.5 4803.5 4898.4 4927.7 10174.0 10179.9 10191.8 10192.4 10194.7 5449.4 5456.1 5457.4 5461.3 5468.7 4852.1 4934.0 4934.6 4986.6 4988.0 3983.2 3986.9 4036.0 4092.2 4094.0 1292.0 1298.9 1302.3 1324.0 1326.8 638.8 791.5 885.5 941.2 953.0 5095.8 5916.4 5969.3 6073.8 6170.6 928.1 956.9 958.5 964.9 995.0 3916.4 4065.7 4095.8 4147.2 4174.0 10638.2 11044.8 11076.4 11089.8 11094.8 9350.0 11006.8 11016.2 11019.8 11021.0 7957.9 8300.8 8360.5 8373.5 8387.5 5990.8 6109.1 6132.0 6148.5 6160.2 10157.1 10393.5 10396.9 10403.5 10417.9 10119.3 10434.3 10570.9 10590.6 10597.4 7553.4 7677.2 7684.3 7692.3 7703.5 8354.2 8455.2 8501.9 8568.8 8578.3 7531.8 7664.9 7680.8 7709.9 7742.3 6489.2 7434.1 7441.7 7525.3 7657.1 7025.3 7076.9 7190.6 7205.0 7215.3 4898.4 5064.2 5141.5 5207.2 5357.6 5082.4 5120.5 5220.6 5246.3 5372.9 03:09:12 INFO - PROCESS | 2033 | 03:09:12 INFO - PROCESS | 2033 | [#4] prototype.html Cycles:180 Average:4460.31 Median:5084.30 stddev:1374.91 (27.0%) stddev-sans-first:1342.82 03:09:12 INFO - PROCESS | 2033 | Values: 298.6 301.5 307.8 315.6 318.2 5322.5 5335.7 5373.6 5379.7 5387.4 4984.8 5054.4 5178.5 5182.2 5219.0 3997.0 4002.6 4017.1 4028.4 4036.9 4004.3 4016.5 4051.7 4063.3 4067.4 3290.7 3889.8 4026.6 4027.3 4109.8 3519.5 4019.3 4024.2 4038.6 4051.4 3218.9 3242.7 3350.1 3519.4 3547.8 4512.2 4883.9 4997.4 5120.0 5163.0 3467.6 4591.4 4610.2 4665.7 4711.5 4802.7 5346.0 5510.1 5527.6 5550.8 3230.9 3671.9 3862.3 3869.4 3899.4 4880.6 5089.9 5791.9 5844.6 5950.7 3785.3 3799.6 3836.7 3837.7 3879.6 3563.1 3588.8 3603.3 3650.0 3886.7 4408.1 4440.8 4495.8 4509.0 4544.9 5570.7 5594.8 5597.1 5602.5 5610.7 1224.1 1249.2 1291.7 1325.4 1325.5 753.0 862.0 885.8 892.6 897.7 4568.5 5247.0 5257.4 5263.8 5282.0 4989.3 5514.5 5588.9 5607.7 5707.2 3996.1 4774.4 5192.7 5240.8 5266.8 2446.5 2945.2 2965.4 2971.6 2987.8 5405.0 5409.6 5765.2 5851.7 5902.9 4813.8 5078.7 5443.0 5673.9 5828.0 5764.4 5769.7 5800.9 5841.6 5843.4 4716.0 4938.7 5492.0 5581.4 5623.4 5589.7 5604.6 5608.4 5619.2 5631.2 5399.6 5774.8 5815.9 5839.7 5890.6 3198.8 3221.5 3767.1 3767.3 3797.9 4288.7 5175.9 5259.7 5637.3 5683.1 5020.3 5290.4 5488.9 5492.8 5509.0 4604.8 4795.4 5375.5 5392.2 5408.4 4490.5 5170.9 5349.5 5398.3 5406.0 5141.7 5219.5 5392.8 5394.3 5407.5 4852.2 5515.3 5533.3 5539.8 5554.3 03:09:12 INFO - PROCESS | 2033 | 03:09:12 INFO - PROCESS | 2033 | [#5] yui.html Cycles:180 Average:24590.54 Median:12318.52 stddev:39216.56 (318.4%) stddev-sans-first:39285.63 03:09:12 INFO - PROCESS | 2033 | Values: 723.9 725.5 768.1 774.6 826.5 14990.7 16328.7 16377.8 16381.8 16395.6 14726.2 14853.6 14859.3 14868.1 14876.6 678.7 705.2 707.0 862.3 863.9 882.2 882.3 892.9 895.2 899.1 935.7 942.6 943.2 946.0 949.0 729.3 931.2 932.0 935.1 943.0 556.4 556.9 559.5 561.4 675.9 14909.8 15357.0 15363.3 15363.6 15373.0 13855.3 14052.8 14093.4 14121.7 14345.5 12148.9 12352.1 12406.6 12618.7 12972.2 4198.7 4342.8 4577.8 4587.5 4711.0 103022.5 107123.0 107599.9 110648.9 118694.0 10318.6 10851.9 11070.6 11354.4 11422.5 20217.7 20805.3 21026.8 21196.0 21224.6 7703.0 7781.2 7823.9 7827.1 7981.0 4339.3 4410.2 4464.5 4470.4 4561.5 3412.5 3534.8 3540.8 3547.5 3552.4 623.0 640.8 652.3 657.8 663.4 515.6 570.5 595.3 602.3 623.6 7740.5 7887.6 8371.5 8784.6 8855.0 545.3 592.8 602.5 603.5 633.2 4143.4 4209.8 4241.6 4297.5 4370.3 96695.5 156458.2 160313.0 162642.0 170663.0 119388.0 120302.0 121918.0 133684.0 140922.0 68118.0 70207.0 102554.0 104014.0 113706.0 9394.0 10009.0 10080.7 10100.5 10132.7 63729.7 63998.0 65014.0 65647.3 65687.0 94598.0 96895.5 97823.5 97900.5 98423.5 12728.1 12744.8 12922.3 13079.9 13571.5 14438.5 14838.8 14900.3 14912.6 14921.6 13374.9 13520.1 13670.0 13878.4 13950.0 13963.1 13972.0 14018.8 14040.0 14041.7 13508.3 13620.8 13632.4 13637.4 13698.9 10868.4 11249.1 11352.8 11707.1 11822.8 10241.7 10649.6 10651.5 11404.3 11600.4 03:09:12 INFO - PROCESS | 2033 | -------- Summary: end -------- 03:09:12 INFO - PROCESS | 2033 | 03:09:12 INFO - TEST-INFO | 2033: exit 0 03:09:12 INFO - TEST-OK | dromaeo_css | took 1116924ms 03:09:12 INFO - TEST-START | kraken 03:09:12 INFO - operating with platform_type : mac_ 03:09:12 INFO - Initialising browser for kraken test... 03:09:12 INFO - TEST-INFO | started process 2036 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/tmpmMC0V2/profile http://localhost:52676/getInfo.html) 03:09:14 INFO - PROCESS | 2036 | __metrics Screen width/height:1600/1200 03:09:14 INFO - PROCESS | 2036 | colorDepth:24 03:09:14 INFO - PROCESS | 2036 | Browser inner width/height: 1024/689 03:09:14 INFO - PROCESS | 2036 | __metrics 03:09:14 INFO - PROCESS | 2036 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 03:09:14 INFO - PROCESS | 2036 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:09:15 INFO - TEST-INFO | 2036: exit 0 03:09:15 INFO - Browser initialized. 03:09:15 INFO - Running cycle 1/1 for kraken test... 03:09:15 INFO - TEST-INFO | started process 2038 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/tmpmMC0V2/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:09:27 INFO - PROCESS | 2038 | RSS: Main: 219004928 03:09:27 INFO - PROCESS | 2038 | 03:09:30 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52676/tests/kraken/driver.html?testName=audio-beat-detection) 03:09:31 INFO - PROCESS | 2038 | RSS: Main: 269959168 03:09:31 INFO - PROCESS | 2038 | 03:09:33 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52676/tests/kraken/driver.html?testName=audio-dft) 03:09:34 INFO - PROCESS | 2038 | RSS: Main: 279896064 03:09:34 INFO - PROCESS | 2038 | 03:09:37 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52676/tests/kraken/driver.html?testName=audio-fft) 03:09:38 INFO - PROCESS | 2038 | RSS: Main: 378531840 03:09:38 INFO - PROCESS | 2038 | 03:09:40 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52676/tests/kraken/driver.html?testName=audio-oscillator) 03:09:41 INFO - PROCESS | 2038 | RSS: Main: 280264704 03:09:41 INFO - PROCESS | 2038 | 03:09:43 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52676/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:09:43 INFO - PROCESS | 2038 | RSS: Main: 281006080 03:09:43 INFO - PROCESS | 2038 | 03:09:46 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52676/tests/kraken/driver.html?testName=imaging-darkroom) 03:09:46 INFO - PROCESS | 2038 | RSS: Main: 318304256 03:09:46 INFO - PROCESS | 2038 | 03:09:49 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52676/tests/kraken/driver.html?testName=imaging-desaturate) 03:09:50 INFO - PROCESS | 2038 | RSS: Main: 319643648 03:09:50 INFO - PROCESS | 2038 | 03:09:53 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52676/tests/kraken/driver.html?testName=json-parse-financial) 03:09:53 INFO - PROCESS | 2038 | RSS: Main: 319598592 03:09:53 INFO - PROCESS | 2038 | 03:09:55 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52676/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:09:56 INFO - PROCESS | 2038 | RSS: Main: 289996800 03:09:56 INFO - PROCESS | 2038 | 03:09:57 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52676/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:09:58 INFO - PROCESS | 2038 | RSS: Main: 296370176 03:09:58 INFO - PROCESS | 2038 | 03:10:00 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52676/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:10:01 INFO - PROCESS | 2038 | RSS: Main: 305442816 03:10:01 INFO - PROCESS | 2038 | 03:10:04 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52676/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:10:04 INFO - PROCESS | 2038 | RSS: Main: 310136832 03:10:04 INFO - PROCESS | 2038 | 03:10:07 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52676/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:10:08 INFO - PROCESS | 2038 | RSS: Main: 309927936 03:10:08 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | Cycle 1(1): loaded http://localhost:52676/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52676/tests/kraken/driver.html?testName=ai-astar) 03:10:10 INFO - PROCESS | 2038 | RSS: Main: 352751616 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | __start_tp_report 03:10:10 INFO - PROCESS | 2038 | _x_x_mozilla_page_load 03:10:10 INFO - PROCESS | 2038 | _x_x_mozilla_page_load_details 03:10:10 INFO - PROCESS | 2038 | |i|pagename|runs| 03:10:10 INFO - PROCESS | 2038 | |0;ai-astar;115;112;112;112;112;113;112;113;113;113 03:10:10 INFO - PROCESS | 2038 | |1;audio-beat-detection;149;134;136;144;110;108;107;108;140;108 03:10:10 INFO - PROCESS | 2038 | |2;audio-dft;182;187;185;185;185;184;184;186;183;185 03:10:10 INFO - PROCESS | 2038 | |3;audio-fft;80;60;59;89;82;82;82;64;83;59 03:10:10 INFO - PROCESS | 2038 | |4;audio-oscillator;90;70;93;71;68;70;93;69;69;90 03:10:10 INFO - PROCESS | 2038 | |5;imaging-gaussian-blur;86;83;86;84;87;83;87;83;86;83 03:10:10 INFO - PROCESS | 2038 | |6;imaging-darkroom;92;93;93;95;93;93;92;92;92;93 03:10:10 INFO - PROCESS | 2038 | |7;imaging-desaturate;84;84;85;84;84;85;101;113;126;132 03:10:10 INFO - PROCESS | 2038 | |8;json-parse-financial;55;53;51;52;56;57;57;57;56;56 03:10:10 INFO - PROCESS | 2038 | |9;json-stringify-tinderbox;66;73;65;75;72;70;72;70;71;71 03:10:10 INFO - PROCESS | 2038 | |10;stanford-crypto-aes;83;82;86;82;85;85;84;87;89;83 03:10:10 INFO - PROCESS | 2038 | |11;stanford-crypto-ccm;140;139;136;140;137;137;138;141;169;136 03:10:10 INFO - PROCESS | 2038 | |12;stanford-crypto-pbkdf2;163;163;163;165;157;152;204;201;162;162 03:10:10 INFO - PROCESS | 2038 | |13;stanford-crypto-sha256-iterative;66;67;63;67;62;75;83;85;83;65 03:10:10 INFO - PROCESS | 2038 | __end_tp_report 03:10:10 INFO - PROCESS | 2038 | __start_cc_report 03:10:10 INFO - PROCESS | 2038 | _x_x_mozilla_cycle_collect,1952 03:10:10 INFO - PROCESS | 2038 | __end_cc_report 03:10:10 INFO - PROCESS | 2038 | __startTimestamp1477217410436__endTimestamp 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | ------- Summary: start ------- 03:10:10 INFO - PROCESS | 2038 | Number of tests: 14 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#0] ai-astar Cycles:10 Average:112.70 Median:113.00 stddev:0.95 (0.8%) stddev-sans-first:0.53 03:10:10 INFO - PROCESS | 2038 | Values: 115.0 112.0 112.0 112.0 112.0 113.0 112.0 113.0 113.0 113.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#1] audio-beat-detection Cycles:10 Average:124.40 Median:135.00 stddev:17.56 (13.0%) stddev-sans-first:16.22 03:10:10 INFO - PROCESS | 2038 | Values: 149.0 134.0 136.0 144.0 110.0 108.0 107.0 108.0 140.0 108.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#2] audio-dft Cycles:10 Average:184.60 Median:185.00 stddev:1.43 (0.8%) stddev-sans-first:1.17 03:10:10 INFO - PROCESS | 2038 | Values: 182.0 187.0 185.0 185.0 185.0 184.0 184.0 186.0 183.0 185.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#3] audio-fft Cycles:10 Average:74.00 Median:82.00 stddev:11.93 (14.5%) stddev-sans-first:12.45 03:10:10 INFO - PROCESS | 2038 | Values: 80.0 60.0 59.0 89.0 82.0 82.0 82.0 64.0 83.0 59.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#4] audio-oscillator Cycles:10 Average:78.30 Median:80.50 stddev:11.43 (14.2%) stddev-sans-first:11.31 03:10:10 INFO - PROCESS | 2038 | Values: 90.0 70.0 93.0 71.0 68.0 70.0 93.0 69.0 69.0 90.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#5] imaging-gaussian-blur Cycles:10 Average:84.80 Median:86.00 stddev:1.75 (2.0%) stddev-sans-first:1.80 03:10:10 INFO - PROCESS | 2038 | Values: 86.0 83.0 86.0 84.0 87.0 83.0 87.0 83.0 86.0 83.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#6] imaging-darkroom Cycles:10 Average:92.80 Median:93.00 stddev:0.92 (1.0%) stddev-sans-first:0.93 03:10:10 INFO - PROCESS | 2038 | Values: 92.0 93.0 93.0 95.0 93.0 93.0 92.0 92.0 92.0 93.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#7] imaging-desaturate Cycles:10 Average:97.80 Median:84.00 stddev:19.14 (22.8%) stddev-sans-first:19.63 03:10:10 INFO - PROCESS | 2038 | Values: 84.0 84.0 85.0 84.0 84.0 85.0 101.0 113.0 126.0 132.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#8] json-parse-financial Cycles:10 Average:55.00 Median:56.00 stddev:2.21 (3.9%) stddev-sans-first:2.35 03:10:10 INFO - PROCESS | 2038 | Values: 55.0 53.0 51.0 52.0 56.0 57.0 57.0 57.0 56.0 56.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#9] json-stringify-tinderbox Cycles:10 Average:70.50 Median:71.50 stddev:3.03 (4.2%) stddev-sans-first:2.74 03:10:10 INFO - PROCESS | 2038 | Values: 66.0 73.0 65.0 75.0 72.0 70.0 72.0 70.0 71.0 71.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#10] stanford-crypto-aes Cycles:10 Average:84.60 Median:85.00 stddev:2.27 (2.7%) stddev-sans-first:2.33 03:10:10 INFO - PROCESS | 2038 | Values: 83.0 82.0 86.0 82.0 85.0 85.0 84.0 87.0 89.0 83.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#11] stanford-crypto-ccm Cycles:10 Average:141.30 Median:139.50 stddev:9.89 (7.1%) stddev-sans-first:10.48 03:10:10 INFO - PROCESS | 2038 | Values: 140.0 139.0 136.0 140.0 137.0 137.0 138.0 141.0 169.0 136.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:169.20 Median:163.00 stddev:17.96 (11.0%) stddev-sans-first:18.91 03:10:10 INFO - PROCESS | 2038 | Values: 163.0 163.0 163.0 165.0 157.0 152.0 204.0 201.0 162.0 162.0 03:10:10 INFO - PROCESS | 2038 | 03:10:10 INFO - PROCESS | 2038 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.60 Median:71.00 stddev:9.03 (12.7%) stddev-sans-first:9.35 03:10:10 INFO - PROCESS | 2038 | Values: 66.0 67.0 63.0 67.0 62.0 75.0 83.0 85.0 83.0 65.0 03:10:10 INFO - PROCESS | 2038 | -------- Summary: end -------- 03:10:10 INFO - PROCESS | 2038 | 03:10:11 INFO - TEST-INFO | 2038: exit 0 03:10:11 INFO - TEST-OK | kraken | took 58661ms 03:10:11 INFO - SUITE-END | took 1175s 03:10:11 INFO - Completed test suite (00:19:35) 03:10:11 INFO - javascript benchmark 03:10:11 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3283.6716328367165, 3289.42435073862, 3294.670532946705, 3314.038928710674, 3345.8159801210923, 5551.583631227659, 5587.106063029916, 5601.439856014396, 5617.129344951529, 5635.492805647491, 5503.862403439916, 5585.748641311141, 5594.9089927464165, 5597.188407680894, 5633.0, 5083.847484575459, 5104.3619547556555, 5129.769160387773, 5169.638125331228, 5216.60875434344, 5121.743912804363, 5138.511841375082, 5206.401263854667, 5206.5834733221445, 5227.189785583221, 5114.820981265657, 5185.325907632021, 5222.0, 5223.347081614798, 5225.973870130644, 5129.6409251352425, 5132.435432102466, 5138.486151384869, 5146.511081447256, 5151.948480515184, 5099.15863882459, 5145.614078944094, 5163.32876726027, 5175.792968281265, 5193.8961220775755, 5460.945390546083, 5494.697791621459, 5498.5876059295315, 5578.63738856973, 5600.019996500637, 5967.6419414835245, 6033.396660333975, 6058.818235452944, 6075.848103797396, 6094.8781024379705, 6104.08438734189, 6166.630002199882, 6173.506119510428, 6186.10301506279, 6211.596246244025, 4825.638077144228, 5529.0324193266015, 5591.9720401397735, 5658.12299093637, 5658.858528536737, 6198.287196972406, 6229.50163986889, 6241.095041218998, 6280.654563998933, 6321.336259692666, 5982.312034116046, 5996.760129594854, 5998.190244317048, 5998.310194327708, 6028.095785632103, 6009.489193418521, 6132.5707200495535, 6153.2616086069065, 6163.229596300463, 6180.381961803783, 5913.290405151323, 5956.702164891738, 5959.986802243629, 6001.489873360726, 6030.27636683592, 6107.219158344477, 6118.687799483981, 6124.565059171925, 6136.815895523141, 6146.815595532141, 4840.443349014909, 4844.346013288161, 4848.854534363974, 4867.829625963074, 4870.14772414826, 4258.659307255412, 4277.786110694453, 4322.524522302544, 4327.134573085333, 4341.9131617367475, 5543.501084902378, 5578.609497335147, 5613.46672066153, 5614.6631202128, 5615.943840561542, 6122.601731493672, 6123.465646421124, 6144.818589400698, 6156.476699480594, 6186.752529898844, 5634.887302253932, 5643.492085712305, 5647.322321321468, 5650.0, 5654.830355089354, 5161.870953226125, 5231.1891656792495, 5236.450172731885, 5251.133562962068, 5251.1598144297495, 6299.244090709144, 6303.842403939938, 6338.397852204218, 6341.4609758170145, 6350.174477318012, 6155.230596175478, 6155.784547540815, 6165.475934545614, 6176.28972668131, 6189.473894718999, 6203.534734894811, 6252.09344645033, 6268.902941985226, 6272.153259309935, 6298.590591611531, 5981.162637230704, 6010.128531363015, 6032.909506357496, 6091.238595175603, 6124.5406594506485, 6120.642498383738, 6143.170671959407, 6147.815565533041, 6178.721957511832, 6180.0, 5810.5351571875, 5906.26171728534, 5976.282846058501, 5989.191459153133, 6001.159837622824, 4688.0, 5783.074708046693, 5868.178455016216, 5872.765089396376, 5901.203337549376, 5789.421057894177, 5798.159266906359, 5799.739011744397, 5807.186993820784, 5814.854628634318, 5949.524038076857, 5978.491828194652, 5982.012967860428, 5983.521318294439, 5984.012637914695, 5602.607817452739, 5706.914396283976, 5721.485066344049, 5733.512651424676, 5772.826815195551], "value": 5587.830312288394, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [469.1555200638849, 478.6218887079207, 491.45448552107155, 517.8575891629799, 523.1995047577208, 25252.494950100987, 31284.843575782117, 40432.98917527063, 41845.16309673805, 42052.0, 41172.58827411733, 43816.0, 44028.33957490632, 44079.33880991788, 44102.55897441025, 9780.65767698129, 9981.550830212622, 9992.75018124549, 9998.10017098461, 10008.049235322633, 8817.603207855662, 9068.322360363321, 12003.699907502294, 12262.448189831435, 12299.385030748426, 12231.021518278561, 12268.202566833172, 12293.078019148556, 12331.198472099284, 12343.382830858465, 8881.822363552692, 12239.510419583206, 12315.630531083993, 12332.136750427473, 12344.876551234462, 8807.603657835412, 9039.54802259891, 9040.502772347518, 9042.909570904272, 11848.111391645662, 38835.0, 41795.58204417947, 41887.58112418867, 41887.7905610473, 41947.7902610488, 3360.24394511233, 3454.2573346730323, 3577.4276115821604, 3938.9015274618077, 4024.2366544690076, 30328.393432131455, 30613.540796888065, 31909.0, 32106.197345066328, 32848.3430331392, 3113.112762862573, 3226.6450690424035, 3250.236194494292, 3265.5264986576813, 3386.4243078676436, 408461.0, 495921.0, 495960.0, 496171.0, 498073.0, 60840.69579652073, 61205.0, 61275.0, 61364.38635613676, 61427.0, 64627.67686161539, 64829.0, 64883.0, 64968.0, 65041.34958650353, 16793.83206167947, 17032.31870725182, 17063.232154553076, 17071.402500912656, 17095.829041709672, 11853.111016673784, 12144.392780360946, 13213.33933303331, 13283.468661253635, 13285.0, 15121.697566048837, 15216.619584510254, 15230.314635841414, 15243.923780381027, 16820.495385138467, 5569.359523654751, 6405.19935008124, 6445.903311450332, 6451.1936007999, 6469.026946781277, 881.8589025755848, 949.6486300068881, 967.434051080126, 1096.2600244834864, 1110.9611163609236, 29870.40259194804, 30140.0, 30375.0, 30658.080257592308, 30703.539446908315, 1076.6931424543968, 1110.8333749937574, 1139.7777433400408, 1140.9828852567218, 1158.530795028015, 15305.761577198866, 15608.453704120528, 15928.276879964571, 16068.678626427405, 16123.435679751386, 592046.0, 596679.0166049142, 598404.0, 599364.0, 600287.0, 50251.0, 51082.23376649353, 51397.48602514002, 57934.0, 59178.0, 1345.4416417186953, 1375.339836878304, 1392.2899321346185, 1401.4534331610885, 1407.7888316752365, 25632.74367256378, 29746.85126574353, 30621.387572247986, 31455.528167077053, 31674.0, 51495.97008059743, 55660.0, 57206.71396643157, 57301.713491432274, 60443.69778151081, 630012.0, 635308.0, 653001.0, 654915.0, 863948.0, 25561.0, 25726.742732572435, 25824.741752582235, 26070.34824129336, 26076.34809129711, 38566.035849102875, 46059.0, 46115.0, 46404.07191856211, 46800.531994679615, 37497.437538437494, 38126.80936595299, 38169.23661526809, 38229.235415292096, 38395.80802095972, 36660.633393665725, 38022.44380363413, 38067.0, 38563.65027224034, 39746.60253397429, 37707.11464426713, 38232.80883595564, 38325.61674383221, 38489.615103848606, 38511.61488385192, 29195.270118247212, 31772.364552709278, 32164.35671286608, 34566.0, 34717.652823472454, 19270.421887343404, 25387.36531586725, 25489.107881224067, 25938.61092083658, 26037.0], "value": 20227.244349713936, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [319.7010794906762, 341.6719948849105, 356.31765169700026, 379.8100949525236, 405.9898502537436, 11830.881691183085, 14792.852071479281, 15439.536813895573, 16860.156992150372, 20168.294109706163, 19163.712544311813, 20294.0, 20690.896545517287, 20949.68575471369, 20964.26625068123, 5784.2480477537965, 6118.847028824271, 6122.387761223887, 6127.448529632332, 6131.417515336036, 4639.396878405802, 6009.308929473101, 6439.5170362223025, 6918.169819621652, 7023.4381249500175, 6629.33706629338, 6840.002593555012, 6912.239653638096, 6923.0, 6934.167899851999, 5760.74076666551, 6757.898631520531, 6786.524943253974, 6800.047993280945, 6824.727010919582, 5658.207850900877, 5849.415058494159, 5872.412758724136, 5918.526517878602, 5928.940710592882, 25475.0, 25924.74075259242, 25967.0, 26156.776673982735, 26323.73676263232, 2344.10923848938, 2433.9634905476432, 2465.4083020075054, 2503.8873250703764, 2525.01524405482, 14192.432302707879, 15792.605184870356, 15949.44176953801, 16372.918135409365, 16436.096014719187, 1854.7032474803966, 1856.2946080489328, 1957.109515170594, 1969.5765410436825, 2005.769336526289, 114355.85644143535, 123298.38350808188, 127880.3605981964, 130334.34832825775, 133144.0, 11301.039411649937, 11481.0, 11535.8269625954, 11544.826827597593, 11768.235064720766, 14614.63463413402, 14635.97548171639, 14650.901182411362, 14661.85338146605, 14663.926680366743, 8423.0, 8599.495088359512, 8658.220760131619, 8753.562321883881, 8812.911870881337, 7210.567365958059, 7314.524555903849, 7357.926420735831, 8713.390062695551, 8732.345074119467, 4399.230134726474, 4487.820487180542, 4489.483709373464, 4564.543545645409, 4586.197415452282, 1423.7508436023654, 1825.6996184806974, 1838.4576549917806, 1862.919506686119, 1880.0411789987204, 779.9743337511155, 879.6921077622909, 911.148076548416, 968.9854652180223, 974.3131092579856, 20626.484337891372, 21138.0, 21154.471138221666, 21197.78802211958, 21206.78793212079, 941.9873635841361, 943.4339396362265, 965.4882912056621, 987.5013118375318, 995.7411073120896, 9254.722358329262, 11059.336439813636, 11074.0, 11192.552297907992, 11247.606333778278, 592030.0, 594001.0, 603676.0, 610415.0, 614605.0, 103851.56838640671, 113091.0, 114158.0, 117382.41308793401, 140579.0, 923.7967647117623, 953.7710949372239, 993.144708961735, 993.7293284844241, 997.0179373317277, 18677.252909883453, 18684.0, 19002.52493687669, 19015.619687606446, 19146.904265478584, 39759.2048159041, 48360.0, 50765.49234507755, 51694.74152629213, 51772.482275176764, 75309.87035194367, 83517.58241208755, 83567.58216209123, 85915.0, 86556.56721716603, 6376.649284289409, 7397.445191610758, 7557.622118894144, 8004.0, 8410.285125764378, 9284.118008789153, 12229.449674764835, 12806.103572749818, 13148.474061037834, 13166.210027398387, 10834.729131771768, 11031.0, 11133.332000080021, 11136.610218642309, 11263.26788758728, 10592.470376480991, 10713.732156696145, 10937.726556835825, 11066.612668556561, 11165.553377864795, 8916.955415222883, 8984.46093234408, 11285.266457680225, 11583.826242606536, 11586.188966772244, 7981.521108733495, 8052.510285596949, 8164.142765009588, 8369.455985360932, 8390.035145958293, 10534.104601108686, 10862.837057443987, 11131.387773672526, 11141.944290278496, 11242.718932026764], "value": 9652.346418281462, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1410.6050305914343, 1513.7577987521995, 1705.4457301377047, 1883.256113835036, 1926.4220733779862, 7912.564808935506, 8183.42716009878, 8578.74263772087, 9141.908580914198, 9144.908550914497, 8014.358851291897, 8659.134086591337, 8854.690085846996, 8885.600147993357, 8978.775530611721, 2396.604560247557, 2431.963520547193, 2432.85402875828, 2437.683101196842, 2438.670779444779, 2117.14255726431, 2205.823534117275, 2402.939926501834, 2422.39440139965, 2445.4497738008986, 2176.1295481807247, 2203.250894695811, 2203.94490137747, 2351.5884720173985, 2419.0, 2027.9493012674654, 2402.423418379594, 2409.542186984467, 2412.19191570824, 2415.6738840256694, 2371.8102551795814, 2415.082268737886, 2418.6372044193336, 2419.7701218384227, 2421.1404951242407, 8807.691730789391, 9023.09769023099, 9028.638854445815, 9037.819243615091, 9058.547072646406, 5256.26412302278, 5410.810621628224, 5414.972925135349, 5436.3476382833915, 5438.966596346681, 3515.34966031285, 3584.534010578634, 3697.371446854041, 3697.593264740903, 3701.777893326382, 1090.1769164280997, 1091.3560999010542, 1091.579741799405, 1107.224942540217, 1117.0951529261324, 11819.881801181964, 11981.101417393731, 12004.399780011052, 12017.0, 12027.699307517294, 4790.640701947368, 4800.543948324974, 4803.543663352046, 4898.363212782316, 4927.704337739747, 10174.0, 10179.9491002546, 10191.796164076677, 10192.439415832201, 10194.694159175087, 5449.373322067933, 5456.099743542271, 5457.426970168154, 5461.2627295315415, 5468.699221542854, 4852.126617208936, 4933.975330123327, 4934.55588996992, 4986.576141027981, 4987.950120498748, 3983.223271462095, 3986.940195897064, 4036.002178921394, 4092.2224777292217, 4093.959060409358, 1291.9870801291868, 1298.8701129886936, 1302.3423171298434, 1323.9867601324056, 1326.78771396578, 638.7987783848073, 791.5092642561649, 885.5306687455659, 941.2234906202274, 952.9857052144223, 5095.847124586268, 5916.3787802281, 5969.253843269591, 6073.75704971805, 6170.629762214281, 928.1321963963716, 956.8660387545749, 958.5494817435793, 964.8793900762405, 995.0447570332417, 3916.3538016227003, 4065.654419374386, 4095.815688294034, 4147.212029714345, 4173.97913010433, 10638.202134839763, 11044.779104417867, 11076.446177691083, 11089.778204436028, 11094.833577496343, 9350.0, 11006.834897476545, 11016.228863979444, 11019.83470247947, 11021.0, 7957.920420795834, 8300.83398332042, 8360.540170290693, 8373.49759014461, 8387.496750194885, 5990.7903223386975, 6109.144719739329, 6131.957567213673, 6148.538859585459, 6160.229971253593, 10157.085862272135, 10393.480325983823, 10396.896031039592, 10403.479826008821, 10417.895821041995, 10119.342242754197, 10434.321769084985, 10570.942905709675, 10590.629327973484, 10597.41714205726, 7553.357964573072, 7677.155512893689, 7684.346830519468, 7692.34615057704, 7703.499272547267, 8354.206350396702, 8455.239028487465, 8501.87247191305, 8568.828623427622, 8578.270846978077, 7531.774046778605, 7664.923350766421, 7680.846383072419, 7709.922900771145, 7742.303192712683, 6489.1888513935755, 7434.145073316421, 7441.739539116105, 7525.285097915908, 7657.119431265253, 7025.297470252934, 7076.893846592408, 7190.568565886064, 7205.0, 7215.314545118205, 4898.4121905371585, 5064.215046667772, 5141.511556402136, 5207.1668533034535, 5357.571394288369, 5082.4409314976065, 5120.462351453193, 5220.634555581073, 5246.265522826731, 5372.892542149213], "value": 4673.3988945151805, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [298.64908732239616, 301.45135852748007, 307.75379696243004, 315.62283071729263, 318.17751113371935, 5322.494363035516, 5335.733213339327, 5373.5969802264835, 5379.650322729025, 5387.353517577886, 4984.800607975677, 5054.418741844689, 5178.4821517848195, 5182.248573956774, 5219.0, 3996.960030399702, 4002.5597184309704, 4017.096153365484, 4028.375601781714, 4036.9394459083137, 4004.3181863617206, 4016.53809811871, 4051.6758659307334, 4063.2889244382263, 4067.434037895402, 3290.720288775457, 3889.835883612143, 4026.5973402659647, 4027.341954310156, 4109.773962432065, 3519.472079188117, 4019.256437559061, 4024.1951609678035, 4038.5961403859524, 4051.39229115635, 3218.871245150191, 3242.7243684286864, 3350.0619826448633, 3519.4017017107153, 3547.840347184383, 4512.210363186462, 4883.898724310053, 4997.400311962551, 5120.0, 5163.0, 3467.630286037001, 4591.449026116888, 4610.193216187187, 4665.743384113873, 4711.528847115295, 4802.687825291345, 5346.0, 5510.1459273812625, 5527.55779537636, 5550.833474995757, 3230.9030729078167, 3671.898430470848, 3862.304785138674, 3869.361555343365, 3899.3566061599804, 4880.609551235928, 5089.898202035939, 5791.88416231673, 5844.620099693507, 5950.7322170502, 3785.337565925952, 3799.6200379961783, 3836.6738827199442, 3837.6929845612285, 3879.553851307079, 3563.0914116900026, 3588.8385022674042, 3603.279344131184, 3650.0, 3886.7279290449965, 4408.074304396048, 4440.82643720069, 4495.797689103998, 4508.954910450853, 4544.931826022612, 5570.749316280777, 5594.776208951596, 5597.132444471114, 5602.4957753802355, 5610.663360198401, 1224.13086708438, 1249.1568191470722, 1291.6964513339358, 1325.3969443903002, 1325.5228117877557, 752.9887051694229, 861.9655213791503, 885.7696998780364, 892.5849479991834, 897.7441429192648, 4568.520305367889, 5247.0, 5257.395399529027, 5263.7894484220205, 5281.973590132025, 4989.3264409305, 5514.4886885465985, 5588.860278492989, 5607.719614019283, 5707.200991861143, 3996.120853412303, 4774.427068751772, 5192.688438693691, 5240.816571419982, 5266.8419947401635, 2446.47400808827, 2945.23423909785, 2965.4365670522534, 2971.5884954646804, 2987.848748900831, 5405.0, 5409.594280428983, 5765.164051212634, 5851.707414629252, 5902.90097698703, 4813.7593120343845, 5078.704930242764, 5443.03354671697, 5673.914781357416, 5828.0, 5764.394738552392, 5769.68266745333, 5800.854978625483, 5841.620294680833, 5843.357230704619, 4715.976420117878, 4938.728369939688, 5491.972540137273, 5581.441855814386, 5623.3814280428305, 5589.664620122806, 5604.607677462538, 5608.4111168326735, 5619.185218143264, 5631.211630371833, 5399.568034557305, 5774.8055738818975, 5815.883682326415, 5839.708014599338, 5890.586259297824, 3198.8400579971376, 3221.4523531000254, 3767.114728038854, 3767.2842159989514, 3797.9430308544843, 4288.678349123766, 5175.948240517697, 5259.658122222043, 5637.295338082739, 5683.090705487102, 5020.322256495472, 5290.418054013979, 5488.945110548843, 5492.752826122754, 5509.0, 4604.802751284623, 4795.352627395257, 5375.500392317591, 5392.245085688085, 5408.405075441777, 4490.528494508029, 5170.870728231825, 5349.5495405464035, 5398.325209348832, 5405.972970135124, 5141.665791723526, 5219.530242278061, 5392.784288628411, 5394.2987411637805, 5407.540359069523, 4852.228936438245, 5515.283013208417, 5533.3083364579425, 5539.750711217925, 5554.305711786027], "value": 4022.187247012043, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [723.8516104198638, 725.4776560876168, 768.1166658342905, 774.554631087125, 826.5164878546052, 14990.700185996287, 16328.673426531463, 16377.83622163778, 16381.83618163818, 16395.59011024725, 14726.190059546721, 14853.628659283497, 14859.331330090145, 14868.107913525197, 14876.62808429787, 678.6708446403491, 705.1643802094509, 707.0172460280214, 862.2799962031711, 863.9222469977701, 882.2104216726026, 882.2500874256863, 892.8839250897374, 895.243519226256, 899.0784445942928, 935.7333160049387, 942.6135284533343, 943.1747221181466, 945.9716208513755, 948.9620415183384, 729.3253740290211, 931.1759093202497, 931.9906800931972, 935.1303287942211, 942.9717108486757, 556.4352182534731, 556.9331680198402, 559.4880684173976, 561.3544423912492, 675.9188897332302, 14909.776353354708, 15357.0, 15363.308651110727, 15363.615909602238, 15373.0, 13855.307234638227, 14052.789208161887, 14093.365798539091, 14121.717565648732, 14345.497907573184, 12148.878511214863, 12352.07359448036, 12406.62780116598, 12618.68453288666, 12972.221666700028, 4198.727082739612, 4342.761148136851, 4577.771111444415, 4587.4953755087245, 4711.0342379812055, 103022.48488757583, 107123.0, 107599.92400076055, 110648.89351106467, 118693.99999999914, 10318.587256509805, 10851.891481085087, 11070.612528561462, 11354.432278386048, 11422.485988130555, 20217.696734548994, 20805.271815486387, 21026.789732102483, 21196.0, 21224.575508490052, 7702.961485192538, 7781.221877812287, 7823.882641760378, 7827.060752709597, 7981.0, 4339.262325404688, 4410.184115938561, 4464.464264288306, 4470.396496472999, 4561.521040290788, 3412.4710669846213, 3534.8055856928117, 3540.760733743169, 3547.467879818048, 3552.4138517144384, 622.9875402491925, 640.7693230437039, 652.3346186889346, 657.7763560389395, 663.3764261594087, 515.6081378152631, 570.520762559452, 595.3391735173954, 602.3223873142714, 623.554158776477, 7740.496867703581, 7887.645055972495, 8371.539565323965, 8784.560771961376, 8854.981677107085, 545.312905738772, 592.8043745563954, 602.457787990803, 603.477991537317, 633.2432742872223, 4143.4199212110325, 4209.789510524462, 4241.575842415796, 4297.474396589166, 4370.344448332712, 96695.51652241693, 156458.21770891073, 160313.0, 162642.0, 170663.0, 119388.0, 120302.0, 121918.0, 133683.995353314, 140922.0, 68118.0, 70207.0, 102554.0, 104014.0, 113706.0, 9393.953030235078, 10009.0, 10080.69757907264, 10100.545475453475, 10132.746681333025, 63729.681351592946, 63998.04002939867, 65014.0, 65647.34352656604, 65687.0, 94598.0, 96895.51552242193, 97823.51088244798, 97900.51049744706, 98423.50788246012, 12728.109032368016, 12744.808827867404, 12922.320098387525, 13079.869201307865, 13571.524996625465, 14438.494652687106, 14838.77741833895, 14900.32948517341, 14912.62718432048, 14921.552353429415, 13374.866251337362, 13520.12119212248, 13670.043096983116, 13878.424444499658, 13950.023498355424, 13963.092398994033, 13972.0, 14018.78971815444, 14040.0, 14041.719165616834, 13508.257045862572, 13620.795688064489, 13632.386542605409, 13637.38631761593, 13698.863011370157, 10868.402237876677, 11249.100071994384, 11352.829707554229, 11707.121965852424, 11822.763544729229, 10241.724587099381, 10649.574017039542, 10651.467426628482, 11404.258723182966, 11600.361980091177], "value": 7788.464770579995, "unit": "score"}], "name": "dromaeo_css", "value": 7366.046991677989, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 112.0, 112.0, 112.0, 112.0, 113.0, 112.0, 113.0, 113.0, 113.0], "value": 112.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 134.0, 136.0, 144.0, 110.0, 108.0, 107.0, 108.0, 140.0, 108.0], "value": 124.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [182.0, 187.0, 185.0, 185.0, 185.0, 184.0, 184.0, 186.0, 183.0, 185.0], "value": 184.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 60.0, 59.0, 89.0, 82.0, 82.0, 82.0, 64.0, 83.0, 59.0], "value": 74.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 70.0, 93.0, 71.0, 68.0, 70.0, 93.0, 69.0, 69.0, 90.0], "value": 78.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 83.0, 86.0, 84.0, 87.0, 83.0, 87.0, 83.0, 86.0, 83.0], "value": 84.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 93.0, 93.0, 95.0, 93.0, 93.0, 92.0, 92.0, 92.0, 93.0], "value": 92.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 85.0, 84.0, 84.0, 85.0, 101.0, 113.0, 126.0, 132.0], "value": 97.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 53.0, 51.0, 52.0, 56.0, 57.0, 57.0, 57.0, 56.0, 56.0], "value": 55.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 73.0, 65.0, 75.0, 72.0, 70.0, 72.0, 70.0, 71.0, 71.0], "value": 70.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 82.0, 86.0, 82.0, 85.0, 85.0, 84.0, 87.0, 89.0, 83.0], "value": 84.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [140.0, 139.0, 136.0, 140.0, 137.0, 137.0, 138.0, 141.0, 169.0, 136.0], "value": 141.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 163.0, 165.0, 157.0, 152.0, 204.0, 201.0, 162.0, 162.0], "value": 169.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 67.0, 63.0, 67.0, 62.0, 75.0, 83.0, 85.0, 83.0, 65.0], "value": 71.6, "unit": "score"}], "name": "kraken", "value": 1441.5999999999997, "alertThreshold": 2.0}]} 03:10:11 INFO - Return code: 0 03:10:11 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:10:11 INFO - # TBPL SUCCESS # 03:10:11 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:10:11 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:10:11 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:10:11 INFO - 2016-10-23 03:10:11.764 screenresolution[2042:26147] starting screenresolution argv=screenresolution get 03:10:11 INFO - 2016-10-23 03:10:11.766 screenresolution[2042:26147] Display 0: 1600x1200x32@60 03:10:11 INFO - 2016-10-23 03:10:11.772 screenresolution[2043:26150] starting screenresolution argv=screenresolution list 03:10:11 INFO - Available Modes on Display 0 03:10:11 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:10:11 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:10:11 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:10:11 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:10:11 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:10:11 INFO - Intel Iris: 03:10:11 INFO - Chipset Model: Intel Iris 03:10:11 INFO - Type: GPU 03:10:12 INFO - Bus: Built-In 03:10:12 INFO - VRAM (Dynamic, Max): 1536 MB 03:10:12 INFO - Vendor: Intel (0x8086) 03:10:12 INFO - Device ID: 0x0a2e 03:10:12 INFO - Revision ID: 0x0009 03:10:12 INFO - Displays: 03:10:12 INFO - Display: 03:10:12 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:10:12 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:10:12 INFO - Display Serial Number: 1600x1200 60 03:10:12 INFO - Main Display: Yes 03:10:12 INFO - Mirror: Off 03:10:12 INFO - Online: Yes 03:10:12 INFO - Rotation: Supported 03:10:12 INFO - Return code: 0 03:10:12 INFO - Running post-action listener: _resource_record_post_action 03:10:12 INFO - [mozharness: 2016-10-23 10:10:12.005857Z] Finished run-tests step (success) 03:10:12 INFO - Running post-run listener: _resource_record_post_run 03:10:12 INFO - Total resource usage - Wall time: 1209s; CPU: 53.0%; Read bytes: 1351680; Write bytes: 663605760; Read time: 35; Write time: 1961 03:10:12 INFO - TinderboxPrint: CPU usage
53.4% 03:10:12 INFO - TinderboxPrint: I/O read bytes / time
1,351,680 / 35 03:10:12 INFO - TinderboxPrint: I/O write bytes / time
663,605,760 / 1,961 03:10:12 INFO - TinderboxPrint: CPU idle
2,255.1 (46.6%) 03:10:12 INFO - TinderboxPrint: CPU system
967.8 (20.0%) 03:10:12 INFO - TinderboxPrint: CPU user
1,614.8 (33.4%) 03:10:12 INFO - TinderboxPrint: Swap in / out
364,363,776 / 0 03:10:12 INFO - install - Wall time: 33s; CPU: 54.0%; Read bytes: 362545664; Write bytes: 357271040; Read time: 29246; Write time: 667 03:10:12 INFO - run-tests - Wall time: 1177s; CPU: 53.0%; Read bytes: 466944; Write bytes: 296074240; Read time: 5; Write time: 1263 03:10:12 INFO - Running post-run listener: _upload_blobber_files 03:10:12 INFO - Blob upload gear active. 03:10:12 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:10:12 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 03:10:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:10:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:10:12 INFO - (blobuploader) - INFO - Open directory for files ... 03:10:12 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 03:10:12 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:10:12 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:10:13 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 03:10:13 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:10:13 INFO - (blobuploader) - INFO - Done attempting. 03:10:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 03:10:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:10:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:10:14 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 03:10:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:10:14 INFO - (blobuploader) - INFO - Done attempting. 03:10:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:10:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:10:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:10:16 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:10:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:10:16 INFO - (blobuploader) - INFO - Done attempting. 03:10:16 INFO - (blobuploader) - INFO - Iteration through files over. 03:10:16 INFO - Return code: 0 03:10:16 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:10:16 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:10:16 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0f00318326abe8a30a4fc883261672031d12aed12dc617a1f20800792edf5a98c0f9b63f5e279a1b12043949b0cfc83a833dd0c515ef415908a73d0f0183d286", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0f628286091123ff3dd53e8c9ca70b2bedce51994ae1dfa0aee61f81833b431ff93b8fc5f1e1109ee76cf5bdfb555d9c02a78485b694a8528c3053177eea4fa6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b5e943e9f8ed1cb34224877daa8f1674d483b92d6365fdfa45d3b3b8ac860f4a41c9d589ab9a6741fcef00d964af74eee2e133332d1314b2068dff576057ec8e"} 03:10:16 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:10:16 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:10:16 INFO - Contents: 03:10:16 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0f00318326abe8a30a4fc883261672031d12aed12dc617a1f20800792edf5a98c0f9b63f5e279a1b12043949b0cfc83a833dd0c515ef415908a73d0f0183d286", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0f628286091123ff3dd53e8c9ca70b2bedce51994ae1dfa0aee61f81833b431ff93b8fc5f1e1109ee76cf5bdfb555d9c02a78485b694a8528c3053177eea4fa6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b5e943e9f8ed1cb34224877daa8f1674d483b92d6365fdfa45d3b3b8ac860f4a41c9d589ab9a6741fcef00d964af74eee2e133332d1314b2068dff576057ec8e"} 03:10:16 INFO - Running post-run listener: copy_logs_to_upload_dir 03:10:16 INFO - Copying logs to upload dir... 03:10:16 INFO - mkdir: /builds/slave/test/build/upload/logs 03:10:16 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1331.226399 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 22 mins, 11 secs) (at 2016-10-23 03:10:16.761695) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-23 03:10:16.765732) ========= 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.GBd97ieS8T/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.YrRjbt7CFG/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0f00318326abe8a30a4fc883261672031d12aed12dc617a1f20800792edf5a98c0f9b63f5e279a1b12043949b0cfc83a833dd0c515ef415908a73d0f0183d286", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0f628286091123ff3dd53e8c9ca70b2bedce51994ae1dfa0aee61f81833b431ff93b8fc5f1e1109ee76cf5bdfb555d9c02a78485b694a8528c3053177eea4fa6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b5e943e9f8ed1cb34224877daa8f1674d483b92d6365fdfa45d3b3b8ac860f4a41c9d589ab9a6741fcef00d964af74eee2e133332d1314b2068dff576057ec8e"} build_url:https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011105 build_url: 'https://queue.taskcluster.net/v1/task/A7EpEy7kQ8yfJhya3wfyRw/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0f00318326abe8a30a4fc883261672031d12aed12dc617a1f20800792edf5a98c0f9b63f5e279a1b12043949b0cfc83a833dd0c515ef415908a73d0f0183d286", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0f628286091123ff3dd53e8c9ca70b2bedce51994ae1dfa0aee61f81833b431ff93b8fc5f1e1109ee76cf5bdfb555d9c02a78485b694a8528c3053177eea4fa6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b5e943e9f8ed1cb34224877daa8f1674d483b92d6365fdfa45d3b3b8ac860f4a41c9d589ab9a6741fcef00d964af74eee2e133332d1314b2068dff576057ec8e"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-23 03:10:16.798867) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-23 03:10:16.799216) ========= 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.GBd97ieS8T/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.YrRjbt7CFG/Listeners TMPDIR=/var/folders/9c/2dh985pd15l19fywb0pq404000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005131 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-23 03:10:16.848165) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-23 03:10:16.848486) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-23 03:10:16.848814) ========= ========= Total master_lag: 0.18 =========