builder: mozilla-beta_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0085 starttime: 1489007375.02 results: success (0) buildid: 20170308121723 builduid: ae5a6594308d4503ae79b7aac21a2b82 revision: b4489256ab9405e61eef4db767cc24bd6da8e43b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:35.019733) ========= master: http://buildbot-master132.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:35.020219) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:35.020500) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:35.045264) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:35.045556) ========= 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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners TMPDIR=/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 --2017-03-08 13:09:35-- 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% 9.59M=0.001s 2017-03-08 13:09:35 (9.59 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.121648 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:35.190640) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:35.191027) ========= 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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners TMPDIR=/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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.019854 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:35.239566) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-08 13:09:35.239939) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev b4489256ab9405e61eef4db767cc24bd6da8e43b --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-beta --rev b4489256ab9405e61eef4db767cc24bd6da8e43b --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.eGCLYfFpqp/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.u9vwbxEeCy/Listeners TMPDIR=/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 2017-03-08 13:09:35,323 truncating revision to first 12 chars 2017-03-08 13:09:35,323 Setting DEBUG logging. 2017-03-08 13:09:35,323 attempt 1/10 2017-03-08 13:09:35,324 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/b4489256ab94?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-08 13:09:36,884 unpacking tar archive at: mozilla-beta-b4489256ab94/testing/mozharness/ program finished with exit code 0 elapsedTime=1.808299 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-08 13:09:37.072043) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:37.072377) ========= script_repo_revision: b4489256ab9405e61eef4db767cc24bd6da8e43b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:37.072796) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:37.073136) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-08 13:09:37.092882) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2017-03-08 13:09:37.093173) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 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-Beta', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.eGCLYfFpqp/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.u9vwbxEeCy/Listeners TMPDIR=/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:09:37 INFO - MultiFileLogger online at 20170308 13:09:37 in /builds/slave/test 13:09:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 13:09:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:09:37 INFO - {'append_to_log': False, 13:09:37 INFO - 'base_work_dir': '/builds/slave/test', 13:09:37 INFO - 'blob_upload_branch': 'Mozilla-Beta', 13:09:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:09:37 INFO - 'branch': 'Mozilla-Beta', 13:09:37 INFO - 'buildbot_json_path': 'buildprops.json', 13:09:37 INFO - 'config_files': ('talos/mac_config.py',), 13:09:37 INFO - 'default_actions': ('clobber', 13:09:37 INFO - 'read-buildbot-config', 13:09:37 INFO - 'download-and-extract', 13:09:37 INFO - 'populate-webroot', 13:09:37 INFO - 'create-virtualenv', 13:09:37 INFO - 'install', 13:09:37 INFO - 'run-tests'), 13:09:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:09:37 INFO - 'download_minidump_stackwalk': True, 13:09:37 INFO - 'download_symbols': 'ondemand', 13:09:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:09:37 INFO - 'tooltool.py': '/tools/tooltool.py', 13:09:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:09:37 INFO - '/tools/misc-python/virtualenv.py')}, 13:09:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:09:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:09:37 INFO - 'installer_path': 'installer.exe', 13:09:37 INFO - 'log_level': 'info', 13:09:37 INFO - 'log_name': 'talos', 13:09:37 INFO - 'log_to_console': True, 13:09:37 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 13:09:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 13:09:37 INFO - 'opt_config_files': (), 13:09:37 INFO - 'pip_index': False, 13:09:37 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 13:09:37 INFO - 'cmd': ('bash', 13:09:37 INFO - '-c', 13:09:37 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 13:09:37 INFO - 'enabled': True, 13:09:37 INFO - 'halt_on_failure': False, 13:09:37 INFO - 'name': 'check_screen_resolution'},), 13:09:37 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 13:09:37 INFO - 'cmd': ('bash', 13:09:37 INFO - '-c', 13:09:37 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 13:09:37 INFO - 'enabled': True, 13:09:37 INFO - 'halt_on_failure': False, 13:09:37 INFO - 'name': 'check_screen_resolution'},), 13:09:37 INFO - 'run_cmd_checks_enabled': True, 13:09:37 INFO - 'sps_profile': False, 13:09:37 INFO - 'sps_profile_interval': 0, 13:09:37 INFO - 'suite': 'dromaeojs', 13:09:37 INFO - 'system_bits': '32', 13:09:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:09:37 INFO - 'title': 't-yosemite-r7-0085', 13:09:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:09:37 INFO - 'use_talos_json': True, 13:09:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:09:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:09:37 INFO - 'work_dir': 'build'} 13:09:37 INFO - [mozharness: 2017-03-08 21:09:37.300912Z] Running clobber step. 13:09:37 INFO - Running pre-action listener: _resource_record_pre_action 13:09:37 INFO - Running main action method: clobber 13:09:37 INFO - rmtree: /builds/slave/test/build 13:09:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:09:38 INFO - Running post-action listener: _resource_record_post_action 13:09:38 INFO - [mozharness: 2017-03-08 21:09:38.347645Z] Finished clobber step (success) 13:09:38 INFO - [mozharness: 2017-03-08 21:09:38.347754Z] Running read-buildbot-config step. 13:09:38 INFO - Running pre-action listener: _resource_record_pre_action 13:09:38 INFO - Running main action method: read_buildbot_config 13:09:38 INFO - Using buildbot properties: 13:09:38 INFO - { 13:09:38 INFO - "project": "", 13:09:38 INFO - "product": "firefox", 13:09:38 INFO - "script_repo_revision": "production", 13:09:38 INFO - "builddir": "mozilla-beta_yosemite_r7_test-dromaeojs", 13:09:38 INFO - "repository": "", 13:09:38 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-beta talos dromaeojs", 13:09:38 INFO - "buildid": "20170308121723", 13:09:38 INFO - "pgo_build": "False", 13:09:38 INFO - "basedir": "/builds/slave/test", 13:09:38 INFO - "buildnumber": 3, 13:09:38 INFO - "slavename": "t-yosemite-r7-0085", 13:09:38 INFO - "master": "http://buildbot-master132.bb.releng.scl3.mozilla.com:8201/", 13:09:38 INFO - "platform": "yosemite_r7", 13:09:38 INFO - "scheduler": "tests-mozilla-beta-macosx64-talos", 13:09:38 INFO - "branch": "mozilla-beta", 13:09:38 INFO - "repo_path": "releases/mozilla-beta", 13:09:38 INFO - "revision": "b4489256ab9405e61eef4db767cc24bd6da8e43b", 13:09:38 INFO - "stage_platform": "macosx64", 13:09:38 INFO - "builduid": "ae5a6594308d4503ae79b7aac21a2b82", 13:09:38 INFO - "slavebuilddir": "test" 13:09:38 INFO - } 13:09:38 INFO - Found installer url https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.dmg. 13:09:38 INFO - Running post-action listener: _resource_record_post_action 13:09:38 INFO - [mozharness: 2017-03-08 21:09:38.351308Z] Finished read-buildbot-config step (success) 13:09:38 INFO - [mozharness: 2017-03-08 21:09:38.351422Z] Running download-and-extract step. 13:09:38 INFO - Running pre-action listener: _resource_record_pre_action 13:09:38 INFO - Running main action method: download_and_extract 13:09:38 INFO - mkdir: /builds/slave/test/build/tests 13:09:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:09:38 INFO - trying https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.test_packages.json 13:09:38 INFO - Downloading https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-53.0.en-US.mac.test_packages.json 13:09:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-53.0.en-US.mac.test_packages.json'}, attempt #1 13:09:39 INFO - Downloaded 1165 bytes. 13:09:39 INFO - Reading from file /builds/slave/test/build/firefox-53.0.en-US.mac.test_packages.json 13:09:39 INFO - Using the following test package requirements: 13:09:39 INFO - {u'common': [u'firefox-53.0.en-US.mac.common.tests.zip'], 13:09:39 INFO - u'cppunittest': [u'firefox-53.0.en-US.mac.common.tests.zip', 13:09:39 INFO - u'firefox-53.0.en-US.mac.cppunittest.tests.zip'], 13:09:39 INFO - u'gtest': [u'firefox-53.0.en-US.mac.common.tests.zip', 13:09:39 INFO - u'firefox-53.0.en-US.mac.gtest.tests.zip'], 13:09:39 INFO - u'jittest': [u'firefox-53.0.en-US.mac.common.tests.zip', u'jsshell-mac.zip'], 13:09:39 INFO - u'mochitest': [u'firefox-53.0.en-US.mac.common.tests.zip', 13:09:39 INFO - u'firefox-53.0.en-US.mac.mochitest.tests.zip'], 13:09:39 INFO - u'mozbase': [u'firefox-53.0.en-US.mac.common.tests.zip'], 13:09:39 INFO - u'reftest': [u'firefox-53.0.en-US.mac.common.tests.zip', 13:09:39 INFO - u'firefox-53.0.en-US.mac.reftest.tests.zip'], 13:09:39 INFO - u'talos': [u'firefox-53.0.en-US.mac.common.tests.zip', 13:09:39 INFO - u'firefox-53.0.en-US.mac.talos.tests.zip'], 13:09:39 INFO - u'web-platform': [u'firefox-53.0.en-US.mac.common.tests.zip', 13:09:39 INFO - u'firefox-53.0.en-US.mac.web-platform.tests.zip'], 13:09:39 INFO - u'xpcshell': [u'firefox-53.0.en-US.mac.common.tests.zip', 13:09:39 INFO - u'firefox-53.0.en-US.mac.xpcshell.tests.zip']} 13:09:39 INFO - Downloading packages: [u'firefox-53.0.en-US.mac.common.tests.zip'] for test suite category: common 13:09:39 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip 13:09:39 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip'}, attempt #1 13:09:39 INFO - Fetch https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip into memory 13:09:40 INFO - Expected file size: 16103423 13:09:40 INFO - Obtained file size: 16103423 13:09:46 INFO - Downloading packages: [u'firefox-53.0.en-US.mac.common.tests.zip', u'firefox-53.0.en-US.mac.talos.tests.zip'] for test suite category: talos 13:09:46 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip 13:09:46 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip'}, attempt #1 13:09:46 INFO - Fetch https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip into memory 13:09:47 INFO - Expected file size: 16103423 13:09:47 INFO - Obtained file size: 16103423 13:09:54 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.talos.tests.zip 13:09:54 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.talos.tests.zip'}, attempt #1 13:09:54 INFO - Fetch https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.talos.tests.zip into memory 13:09:54 INFO - Expected file size: 14403650 13:09:54 INFO - Obtained file size: 14403650 13:09: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')]} 13:09:55 INFO - trying https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.dmg 13:09:55 INFO - Downloading https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.dmg to /builds/slave/test/build/firefox-53.0.en-US.mac.dmg 13:09:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-53.0.en-US.mac.dmg'}, attempt #1 13:09:57 INFO - Downloaded 58692809 bytes. 13:09:57 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.dmg 13:09:57 INFO - mkdir: /builds/slave/test/properties 13:09:57 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:09:57 INFO - Writing to file /builds/slave/test/properties/build_url 13:09:57 INFO - Contents: 13:09:57 INFO - build_url:https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.dmg 13:09:57 INFO - Running post-action listener: _resource_record_post_action 13:09:57 INFO - Running post-action listener: set_extra_try_arguments 13:09:57 INFO - [mozharness: 2017-03-08 21:09:57.717769Z] Finished download-and-extract step (success) 13:09:57 INFO - [mozharness: 2017-03-08 21:09:57.717889Z] Running populate-webroot step. 13:09:57 INFO - Running pre-action listener: _resource_record_pre_action 13:09:57 INFO - Running main action method: populate_webroot 13:09:57 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:09:57 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:09:57 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:09:57 INFO - '--tppagecycles', 13:09:57 INFO - '7'], 13:09:57 INFO - 'tests': ['tsvgm']}}, 13:09:57 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:09:57 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 13:09:57 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:09:57 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 13:09:57 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 13:09:57 INFO - 'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:09:57 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 13:09:57 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:09:57 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 13:09:57 INFO - 'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['damp', 'tps']}, 13:09:57 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 13:09:57 INFO - 'tests': ['damp', 'tps']}, 13:09:57 INFO - 'g3': {'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['dromaeo_dom']}, 13:09:57 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:09:57 INFO - 'g4': {'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['basic_compositor_video']}, 13:09:57 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 13:09:57 INFO - 'other': {'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['a11yr', 13:09:57 INFO - 'ts_paint', 13:09:57 INFO - 'tpaint', 13:09:57 INFO - 'sessionrestore', 13:09:57 INFO - 'sessionrestore_no_auto_restore', 13:09:57 INFO - 'tabpaint']}, 13:09:57 INFO - 'other-e10s': {'tests': ['a11yr', 13:09:57 INFO - 'ts_paint', 13:09:57 INFO - 'tpaint', 13:09:57 INFO - 'sessionrestore', 13:09:57 INFO - 'sessionrestore_no_auto_restore', 13:09:57 INFO - 'tabpaint']}, 13:09:57 INFO - 'other-e10s_l64': {'tests': ['a11yr', 13:09:57 INFO - 'ts_paint', 13:09:57 INFO - 'tpaint', 13:09:57 INFO - 'sessionrestore', 13:09:57 INFO - 'sessionrestore_no_auto_restore', 13:09:57 INFO - 'tabpaint']}, 13:09:57 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 13:09:57 INFO - 'ts_paint', 13:09:57 INFO - 'tpaint', 13:09:57 INFO - 'sessionrestore', 13:09:57 INFO - 'sessionrestore_no_auto_restore', 13:09:57 INFO - 'tabpaint']}, 13:09:57 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['a11yr', 13:09:57 INFO - 'ts_paint', 13:09:57 INFO - 'tpaint', 13:09:57 INFO - 'sessionrestore', 13:09:57 INFO - 'sessionrestore_no_auto_restore', 13:09:57 INFO - 'tabpaint']}, 13:09:57 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['a11yr', 13:09:57 INFO - 'ts_paint', 13:09:57 INFO - 'tpaint', 13:09:57 INFO - 'sessionrestore', 13:09:57 INFO - 'sessionrestore_no_auto_restore', 13:09:57 INFO - 'tabpaint']}, 13:09:57 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['tsvgx', 13:09:57 INFO - 'tsvgr_opacity', 13:09:57 INFO - 'tart', 13:09:57 INFO - 'tscrollx', 13:09:57 INFO - 'cart', 13:09:57 INFO - 'tsvg_static']}, 13:09:57 INFO - 'svgr-e10s': {'tests': ['tsvgx', 13:09:57 INFO - 'tsvgr_opacity', 13:09:57 INFO - 'tart', 13:09:57 INFO - 'tscrollx', 13:09:57 INFO - 'cart', 13:09:57 INFO - 'tsvg_static']}, 13:09:57 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 13:09:57 INFO - 'talos_options': ['--disable-e10s'], 13:09:57 INFO - 'tests': ['tp5o']}, 13:09:57 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 13:09:57 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 13:09:57 INFO - 'talos_options': ['--disable-e10s', 13:09:57 INFO - '--xperf_path', 13:09:57 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:09:57 INFO - 'tests': ['tp5n']}, 13:09:57 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 13:09:57 INFO - 'talos_options': ['--xperf_path', 13:09:57 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:09:57 INFO - 'tests': ['tp5n']}}, 13:09:57 INFO - 'talos.zip': {'path': '', 13:09:57 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:09:57 INFO - Running post-action listener: _resource_record_post_action 13:09:57 INFO - [mozharness: 2017-03-08 21:09:57.735773Z] Finished populate-webroot step (success) 13:09:57 INFO - [mozharness: 2017-03-08 21:09:57.735854Z] Running create-virtualenv step. 13:09:57 INFO - Running pre-action listener: _resource_record_pre_action 13:09:57 INFO - Running main action method: create_virtualenv 13:09:57 INFO - Creating virtualenv /builds/slave/test/build/venv 13:09:57 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 13:09:57 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:09:57 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:09:57 INFO - Using real prefix '/tools/python27' 13:09:57 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:09:58 INFO - Installing distribute.............................................................................................................................................................................................done. 13:10:01 INFO - Installing pip.................done. 13:10:01 INFO - Return code: 0 13:10:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 13:10:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 13:10:01 INFO - Reading from file tmpfile_stdout 13:10:01 INFO - Output received: 13:10:01 INFO - pip 1.5.5 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 13:10:01 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:10: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')]} 13:10:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10: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')]} 13:10:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10: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', 'pip>=1.5'] in /builds/slave/test/build 13:10: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 pip>=1.5 13:10:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:01 INFO - 'HOME': '/Users/cltbld', 13:10:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:01 INFO - 'LOGNAME': 'cltbld', 13:10:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:01 INFO - 'MOZ_NO_REMOTE': '1', 13:10:01 INFO - 'NO_EM_RESTART': '1', 13:10:01 INFO - 'PAGER': '/bin/cat', 13:10:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:01 INFO - 'PWD': '/builds/slave/test', 13:10:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:01 INFO - 'SHELL': '/bin/bash', 13:10:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:01 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:01 INFO - 'USER': 'cltbld', 13:10:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:01 INFO - 'XPC_FLAGS': '0x0', 13:10:01 INFO - 'XPC_SERVICE_NAME': '0', 13:10:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:01 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 13:10:01 INFO - Cleaning up... 13:10:01 INFO - Return code: 0 13:10:01 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 13:10: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')]} 13:10:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10: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')]} 13:10:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10: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', '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 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10: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', 'psutil>=3.1.1'] in /builds/slave/test/build 13:10: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 psutil>=3.1.1 13:10:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:01 INFO - 'HOME': '/Users/cltbld', 13:10:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:01 INFO - 'LOGNAME': 'cltbld', 13:10:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:01 INFO - 'MOZ_NO_REMOTE': '1', 13:10:01 INFO - 'NO_EM_RESTART': '1', 13:10:01 INFO - 'PAGER': '/bin/cat', 13:10:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:01 INFO - 'PWD': '/builds/slave/test', 13:10:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:01 INFO - 'SHELL': '/bin/bash', 13:10:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:01 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:01 INFO - 'USER': 'cltbld', 13:10:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:01 INFO - 'XPC_FLAGS': '0x0', 13:10:01 INFO - 'XPC_SERVICE_NAME': '0', 13:10:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:02 INFO - Downloading/unpacking psutil>=3.1.1 13:10:02 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 13:10:02 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 13:10:02 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 13:10:02 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 13:10:02 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 13:10:02 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 13:10:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:10:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:10:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:10:06 INFO - Installing collected packages: psutil 13:10:06 INFO - Running setup.py install for psutil 13:10:06 INFO - building 'psutil._psutil_osx' extension 13:10:06 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 13:10:06 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 13:10:06 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 13:10:06 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 13:10:06 INFO - building 'psutil._psutil_posix' extension 13:10:06 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 13:10:06 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 13:10:06 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 13:10:06 INFO - ^ 13:10:06 INFO - 1 warning generated. 13:10:06 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 13:10:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:10:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:10:06 INFO - Successfully installed psutil 13:10:06 INFO - Cleaning up... 13:10:06 INFO - Return code: 0 13:10:06 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 13:10:06 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')]} 13:10:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:06 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')]} 13:10:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:06 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 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10:06 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 13:10:06 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 13:10:06 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:06 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:06 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:06 INFO - 'HOME': '/Users/cltbld', 13:10:06 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:06 INFO - 'LOGNAME': 'cltbld', 13:10:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:06 INFO - 'MOZ_NO_REMOTE': '1', 13:10:06 INFO - 'NO_EM_RESTART': '1', 13:10:06 INFO - 'PAGER': '/bin/cat', 13:10:06 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:06 INFO - 'PWD': '/builds/slave/test', 13:10:06 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:06 INFO - 'SHELL': '/bin/bash', 13:10:06 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:06 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:06 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:06 INFO - 'USER': 'cltbld', 13:10:06 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:06 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:06 INFO - 'XPC_FLAGS': '0x0', 13:10:06 INFO - 'XPC_SERVICE_NAME': '0', 13:10:06 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:07 INFO - Downloading/unpacking mozsystemmonitor==0.3 13:10:07 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 13:10:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:10:07 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 13:10:07 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 13:10:07 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 13:10:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:10:09 INFO - Downloading mozsystemmonitor-0.3.tar.gz 13:10:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:10:09 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 13:10:09 INFO - Installing collected packages: mozsystemmonitor 13:10:09 INFO - Running setup.py install for mozsystemmonitor 13:10:10 INFO - Successfully installed mozsystemmonitor 13:10:10 INFO - Cleaning up... 13:10:10 INFO - Return code: 0 13:10:10 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 13:10:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 13:10:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 13:10:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:10 INFO - 'HOME': '/Users/cltbld', 13:10:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:10 INFO - 'LOGNAME': 'cltbld', 13:10:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:10 INFO - 'MOZ_NO_REMOTE': '1', 13:10:10 INFO - 'NO_EM_RESTART': '1', 13:10:10 INFO - 'PAGER': '/bin/cat', 13:10:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:10 INFO - 'PWD': '/builds/slave/test', 13:10:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:10 INFO - 'SHELL': '/bin/bash', 13:10:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:10 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:10 INFO - 'USER': 'cltbld', 13:10:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:10 INFO - 'XPC_FLAGS': '0x0', 13:10:10 INFO - 'XPC_SERVICE_NAME': '0', 13:10:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:10 INFO - Downloading/unpacking jsonschema==2.5.1 13:10:10 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 13:10:10 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 13:10:10 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 13:10:10 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 13:10:10 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 13:10:10 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 13:10:13 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:10:13 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 13:10:13 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 13:10:13 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 13:10:13 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 13:10:13 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 13:10:13 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 13:10:13 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 13:10:13 INFO - Downloading functools32-3.2.3-2.tar.gz 13:10:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:10:13 INFO - warning: no files found matching '*.txt' 13:10:13 INFO - no previously-included directories found matching 'build' 13:10:13 INFO - no previously-included directories found matching 'dist' 13:10:13 INFO - no previously-included directories found matching '.git*' 13:10:13 INFO - Installing collected packages: jsonschema, functools32 13:10:13 INFO - Running setup.py install for functools32 13:10:13 INFO - warning: no files found matching '*.txt' 13:10:13 INFO - no previously-included directories found matching 'build' 13:10:13 INFO - no previously-included directories found matching 'dist' 13:10:13 INFO - no previously-included directories found matching '.git*' 13:10:13 INFO - Successfully installed jsonschema functools32 13:10:13 INFO - Cleaning up... 13:10:13 INFO - Return code: 0 13:10:13 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 13:10:13 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')]} 13:10:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:13 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')]} 13:10:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:13 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 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10:13 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 13:10:13 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 13:10:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:13 INFO - 'HOME': '/Users/cltbld', 13:10:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:13 INFO - 'LOGNAME': 'cltbld', 13:10:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:13 INFO - 'MOZ_NO_REMOTE': '1', 13:10:13 INFO - 'NO_EM_RESTART': '1', 13:10:13 INFO - 'PAGER': '/bin/cat', 13:10:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:13 INFO - 'PWD': '/builds/slave/test', 13:10:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:13 INFO - 'SHELL': '/bin/bash', 13:10:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:13 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:13 INFO - 'USER': 'cltbld', 13:10:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:13 INFO - 'XPC_FLAGS': '0x0', 13:10:13 INFO - 'XPC_SERVICE_NAME': '0', 13:10:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:14 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 13:10:14 INFO - Cleaning up... 13:10:14 INFO - Return code: 0 13:10:14 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:10:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:14 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 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10:14 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 13:10:14 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 13:10:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:14 INFO - 'HOME': '/Users/cltbld', 13:10:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:14 INFO - 'LOGNAME': 'cltbld', 13:10:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:14 INFO - 'MOZ_NO_REMOTE': '1', 13:10:14 INFO - 'NO_EM_RESTART': '1', 13:10:14 INFO - 'PAGER': '/bin/cat', 13:10:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:14 INFO - 'PWD': '/builds/slave/test', 13:10:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:14 INFO - 'SHELL': '/bin/bash', 13:10:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:14 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:14 INFO - 'USER': 'cltbld', 13:10:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:14 INFO - 'XPC_FLAGS': '0x0', 13:10:14 INFO - 'XPC_SERVICE_NAME': '0', 13:10:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:14 INFO - Downloading/unpacking blobuploader==1.2.4 13:10:14 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 13:10:14 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 13:10:14 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 13:10:14 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 13:10:14 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 13:10:14 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 13:10:16 INFO - Downloading blobuploader-1.2.4.tar.gz 13:10:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:10:17 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:10:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:10:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:10:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:10:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:10:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:10:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:10:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:10:17 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:10:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:10:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:10:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:10:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:10:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:10:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:10:18 INFO - Downloading docopt-0.6.1.tar.gz 13:10:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:10:18 INFO - Installing collected packages: blobuploader, requests, docopt 13:10:18 INFO - Running setup.py install for blobuploader 13:10:18 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:10:18 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:10:18 INFO - Running setup.py install for requests 13:10:18 INFO - Running setup.py install for docopt 13:10:19 INFO - Successfully installed blobuploader requests docopt 13:10:19 INFO - Cleaning up... 13:10:19 INFO - Return code: 0 13:10:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:10:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:19 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 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10:19 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 13:10:19 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 13:10:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:19 INFO - 'HOME': '/Users/cltbld', 13:10:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:19 INFO - 'LOGNAME': 'cltbld', 13:10:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:19 INFO - 'MOZ_NO_REMOTE': '1', 13:10:19 INFO - 'NO_EM_RESTART': '1', 13:10:19 INFO - 'PAGER': '/bin/cat', 13:10:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:19 INFO - 'PWD': '/builds/slave/test', 13:10:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:19 INFO - 'SHELL': '/bin/bash', 13:10:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:19 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:19 INFO - 'USER': 'cltbld', 13:10:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:19 INFO - 'XPC_FLAGS': '0x0', 13:10:19 INFO - 'XPC_SERVICE_NAME': '0', 13:10:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:10:19 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-3vwI_Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:10:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:10:19 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-KcRMXR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:10:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:10:19 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-bxRjJR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:10:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:10:19 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-deHVh9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:10:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:10:19 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-1cG4h4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-cceedd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-0OJ9cP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-KRGQes-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-6MB0aA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-KB7NKT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-XkxM4Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-Gpj1dC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-twZIpq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-xTDSgu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:10:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:10:20 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-jmdpbj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:10:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:10:21 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-09cyNI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:10:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:10:21 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-Iulvxm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:10:21 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:10:21 INFO - Running setup.py install for manifestparser 13:10:21 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:10:21 INFO - Running setup.py install for mozcrash 13:10:21 INFO - Running setup.py install for mozdebug 13:10:21 INFO - Running setup.py install for mozdevice 13:10:21 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:10:21 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:10:21 INFO - Running setup.py install for mozfile 13:10:22 INFO - Running setup.py install for mozhttpd 13:10:22 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:10:22 INFO - Running setup.py install for mozinfo 13:10:22 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:10:22 INFO - Running setup.py install for mozInstall 13:10:22 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:10:22 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:10:22 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:10:22 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:10:22 INFO - Running setup.py install for mozleak 13:10:22 INFO - Running setup.py install for mozlog 13:10:22 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:10:22 INFO - Running setup.py install for moznetwork 13:10:22 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:10:22 INFO - Running setup.py install for mozprocess 13:10:23 INFO - Running setup.py install for mozprofile 13:10:23 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:10:23 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:10:23 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:10:23 INFO - Running setup.py install for mozrunner 13:10:23 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:10:23 INFO - Running setup.py install for mozscreenshot 13:10:23 INFO - Running setup.py install for moztest 13:10:23 INFO - Running setup.py install for mozversion 13:10:23 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:10:23 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:10:23 INFO - Cleaning up... 13:10:23 INFO - Return code: 0 13:10:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:10:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:23 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 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10:23 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 13:10:23 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 13:10:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:23 INFO - 'HOME': '/Users/cltbld', 13:10:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:23 INFO - 'LOGNAME': 'cltbld', 13:10:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:23 INFO - 'MOZ_NO_REMOTE': '1', 13:10:23 INFO - 'NO_EM_RESTART': '1', 13:10:23 INFO - 'PAGER': '/bin/cat', 13:10:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:23 INFO - 'PWD': '/builds/slave/test', 13:10:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:23 INFO - 'SHELL': '/bin/bash', 13:10:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:23 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:23 INFO - 'USER': 'cltbld', 13:10:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:23 INFO - 'XPC_FLAGS': '0x0', 13:10:23 INFO - 'XPC_SERVICE_NAME': '0', 13:10:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-bxYSgO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:10:24 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)) 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-5qTUka-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:10:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-NmTa80-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:10:24 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)) 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-9t7Axi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:10:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-lB_IVr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:10:24 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)) 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-UbNS18-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:10:24 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)) 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-xvtrZQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:10:24 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)) 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-hCZqwZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:10:24 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)) 13:10:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:10:24 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-C5XOGv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:10:25 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)) 13:10:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:10:25 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-v98oOE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:10:25 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)) 13:10:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:10:25 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-XE_H4y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:10:25 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)) 13:10:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:10:25 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-rS7dxa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:10:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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)) 13:10:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:10:25 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-O3ZTX2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:10:25 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)) 13:10:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:10:25 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-QC_1Ml-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:10:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 13:10:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:10:25 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-MUd0Km-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:10:25 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)) 13:10:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:10:25 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-tanXmb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:10:25 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 13:10:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:10:25 INFO - Running setup.py (path:/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/pip-zGPC9g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:10:25 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)) 13:10:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:10:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:10:25 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)) 13:10:25 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 13:10:25 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 13:10:25 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:10:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:10:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:10:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:10:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:10:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:10:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:10:28 INFO - Downloading blessings-1.6.tar.gz 13:10:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:10:28 INFO - Installing collected packages: blessings 13:10:28 INFO - Running setup.py install for blessings 13:10:28 INFO - Successfully installed blessings 13:10:28 INFO - Cleaning up... 13:10:28 INFO - Return code: 0 13:10:28 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:10:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:10:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:10:29 INFO - Reading from file tmpfile_stdout 13:10:29 INFO - Current package versions: 13:10:29 INFO - blessings == 1.6 13:10:29 INFO - blobuploader == 1.2.4 13:10:29 INFO - docopt == 0.6.1 13:10:29 INFO - functools32 == 3.2.3-2 13:10:29 INFO - jsonschema == 2.5.1 13:10:29 INFO - manifestparser == 1.1 13:10:29 INFO - mozInstall == 1.12 13:10:29 INFO - mozcrash == 1.0 13:10:29 INFO - mozdebug == 0.1 13:10:29 INFO - mozdevice == 0.49 13:10:29 INFO - mozfile == 1.2 13:10:29 INFO - mozhttpd == 0.7 13:10:29 INFO - mozinfo == 0.9 13:10:29 INFO - mozleak == 0.1 13:10:29 INFO - mozlog == 3.4 13:10:29 INFO - moznetwork == 0.27 13:10:29 INFO - mozprocess == 0.24 13:10:29 INFO - mozprofile == 0.28 13:10:29 INFO - mozrunner == 6.13 13:10:29 INFO - mozscreenshot == 0.1 13:10:29 INFO - mozsystemmonitor == 0.3 13:10:29 INFO - moztest == 0.8 13:10:29 INFO - mozversion == 1.4 13:10:29 INFO - psutil == 3.1.1 13:10:29 INFO - requests == 1.2.3 13:10:29 INFO - wsgiref == 0.1.2 13:10:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:10:29 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')]} 13:10:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:29 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')]} 13:10:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:29 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 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10:29 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 13:10:29 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 13:10:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:29 INFO - 'HOME': '/Users/cltbld', 13:10:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:29 INFO - 'LOGNAME': 'cltbld', 13:10:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:29 INFO - 'MOZ_NO_REMOTE': '1', 13:10:29 INFO - 'NO_EM_RESTART': '1', 13:10:29 INFO - 'PAGER': '/bin/cat', 13:10:29 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:29 INFO - 'PWD': '/builds/slave/test', 13:10:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:29 INFO - 'SHELL': '/bin/bash', 13:10:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:29 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:29 INFO - 'USER': 'cltbld', 13:10:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:29 INFO - 'XPC_FLAGS': '0x0', 13:10:29 INFO - 'XPC_SERVICE_NAME': '0', 13:10:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 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)) 13:10:29 INFO - Cleaning up... 13:10:29 INFO - Return code: 0 13:10:29 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:10:29 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')]} 13:10:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:10:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:29 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')]} 13:10:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:10:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:10:29 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 0x1040dab70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1040dd768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb611ca5c50>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, '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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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 13:10:29 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 13:10:29 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 13:10:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:29 INFO - 'HOME': '/Users/cltbld', 13:10:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:29 INFO - 'LOGNAME': 'cltbld', 13:10:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:29 INFO - 'MOZ_NO_REMOTE': '1', 13:10:29 INFO - 'NO_EM_RESTART': '1', 13:10:29 INFO - 'PAGER': '/bin/cat', 13:10:29 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:29 INFO - 'PWD': '/builds/slave/test', 13:10:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:29 INFO - 'SHELL': '/bin/bash', 13:10:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:29 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:29 INFO - 'USER': 'cltbld', 13:10:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:29 INFO - 'XPC_FLAGS': '0x0', 13:10:29 INFO - 'XPC_SERVICE_NAME': '0', 13:10:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:10:29 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 13:10:29 INFO - Cleaning up... 13:10:29 INFO - Return code: 0 13:10:29 INFO - Running post-action listener: _resource_record_post_action 13:10:29 INFO - Running post-action listener: _start_resource_monitoring 13:10:29 INFO - Starting resource monitoring. 13:10:29 INFO - [mozharness: 2017-03-08 21:10:29.805689Z] Finished create-virtualenv step (success) 13:10:29 INFO - [mozharness: 2017-03-08 21:10:29.806685Z] Running install step. 13:10:29 INFO - Running pre-action listener: _resource_record_pre_action 13:10:29 INFO - Running main action method: install 13:10:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:10:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:10:30 INFO - Reading from file tmpfile_stdout 13:10:30 INFO - Detecting whether we're running mozinstall >=1.0... 13:10:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:10:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:10:30 INFO - Reading from file tmpfile_stdout 13:10:30 INFO - Output received: 13:10:30 INFO - Usage: mozinstall [options] installer 13:10:30 INFO - Options: 13:10:30 INFO - -h, --help show this help message and exit 13:10:30 INFO - -d DEST, --destination=DEST 13:10:30 INFO - Directory to install application into. [default: 13:10:30 INFO - "/builds/slave/test"] 13:10:30 INFO - --app=APP Application being installed. [default: firefox] 13:10:30 INFO - mkdir: /builds/slave/test/build/application 13:10:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-53.0.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 13:10:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-53.0.en-US.mac.dmg --destination /builds/slave/test/build/application 13:10:44 INFO - Reading from file tmpfile_stdout 13:10:44 INFO - Output received: 13:10:44 INFO - /builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox 13:10:44 INFO - Running post-action listener: _resource_record_post_action 13:10:44 INFO - [mozharness: 2017-03-08 21:10:44.744712Z] Finished install step (success) 13:10:44 INFO - [mozharness: 2017-03-08 21:10:44.744852Z] Running run-tests step. 13:10:44 INFO - Running pre-action listener: _resource_record_pre_action 13:10:44 INFO - Running main action method: run_tests 13:10:44 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 13:10:44 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 13:10:44 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 13:10:44 INFO - 2017-03-08 13:10:44.759 screenresolution[1897:11010] starting screenresolution argv=screenresolution get 13:10:44 INFO - 2017-03-08 13:10:44.762 screenresolution[1897:11010] Display 0: 1600x1200x32@60 13:10:44 INFO - 2017-03-08 13:10:44.768 screenresolution[1898:11012] starting screenresolution argv=screenresolution list 13:10:44 INFO - Available Modes on Display 0 13:10:44 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 13:10:44 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 13:10:44 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 13:10:44 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 13:10:44 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 13:10:44 INFO - Intel Iris: 13:10:44 INFO - Chipset Model: Intel Iris 13:10:44 INFO - Type: GPU 13:10:44 INFO - Bus: Built-In 13:10:44 INFO - VRAM (Dynamic, Max): 1536 MB 13:10:44 INFO - Vendor: Intel (0x8086) 13:10:44 INFO - Device ID: 0x0a2e 13:10:44 INFO - Revision ID: 0x0009 13:10:44 INFO - Displays: 13:10:44 INFO - Display: 13:10:44 INFO - Resolution: 1600 x 1200 @ 60 Hz 13:10:44 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 13:10:44 INFO - Display Serial Number: 1600x1200 60 13:10:44 INFO - Main Display: Yes 13:10:44 INFO - Mirror: Off 13:10:44 INFO - Online: Yes 13:10:44 INFO - Rotation: Supported 13:10:45 INFO - Return code: 0 13:10:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:10:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:10:45 INFO - Python 2.7.3 13:10:45 INFO - Return code: 0 13:10:45 INFO - grabbing minidump binary from tooltool 13:10:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:10:45 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103eb8d30>, '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 0x103ddfdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x103eadbe8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:10:45 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 13:10:45 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 13:10:45 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 13:10:45 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:10:45 INFO - Return code: 0 13:10:45 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 13:10:45 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:10:45 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:10:45 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 13:10:45 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:10:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0085', '--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 13:10:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs --executablePath /builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0085 --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 13:10:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.eGCLYfFpqp/Render', 13:10:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 13:10:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 13:10:45 INFO - 'HOME': '/Users/cltbld', 13:10:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 13:10:45 INFO - 'LOGNAME': 'cltbld', 13:10:45 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:10:45 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 13:10:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:10:45 INFO - 'MOZ_NO_REMOTE': '1', 13:10:45 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:10:45 INFO - 'NO_EM_RESTART': '1', 13:10:45 INFO - 'PAGER': '/bin/cat', 13:10:45 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 13:10:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:10:45 INFO - 'PWD': '/builds/slave/test', 13:10:45 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:10:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 13:10:45 INFO - 'SHELL': '/bin/bash', 13:10:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.u9vwbxEeCy/Listeners', 13:10:45 INFO - 'TMPDIR': '/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/', 13:10:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 13:10:45 INFO - 'USER': 'cltbld', 13:10:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 13:10:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 13:10:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:10:45 INFO - 'XPC_FLAGS': '0x0', 13:10:45 INFO - 'XPC_SERVICE_NAME': '0', 13:10:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 13:10:45 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0085', '--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 13:10:45 INFO - mozversion application_buildid: 20170308121723 13:10:45 INFO - mozversion application_changeset: b4489256ab9405e61eef4db767cc24bd6da8e43b 13:10:45 INFO - mozversion application_display_name: Firefox 13:10:45 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:10:45 INFO - mozversion application_name: Firefox 13:10:45 INFO - mozversion application_remotingname: firefox 13:10:45 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 13:10:45 INFO - mozversion application_vendor: Mozilla 13:10:45 INFO - mozversion application_version: 53.0 13:10:45 INFO - mozversion platform_buildid: 20170308121723 13:10:45 INFO - mozversion platform_changeset: b4489256ab9405e61eef4db767cc24bd6da8e43b 13:10:45 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 13:10:45 INFO - mozversion platform_version: 53.0 13:10:45 INFO - using testdate: 1489007445 13:10:45 INFO - actual date: 1489007445 13:10:45 INFO - starting webserver on 'localhost:49707' 13:10:45 INFO - SUITE-START | Running 2 tests 13:10:45 INFO - TEST-START | dromaeo_css 13:10:45 INFO - operating with platform_type : mac_ 13:10:45 INFO - Initialising browser for dromaeo_css test... 13:10:45 INFO - TEST-INFO | started process 1908 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/tmptbIHF1/profile http://localhost:49707/getInfo.html) 13:10:47 INFO - PROCESS | 1908 | __metrics Screen width/height:1600/1200 13:10:47 INFO - PROCESS | 1908 | colorDepth:24 13:10:47 INFO - PROCESS | 1908 | Browser inner width/height: 1024/689 13:10:47 INFO - PROCESS | 1908 | __metrics 13:10:47 INFO - PROCESS | 1908 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:10:47 INFO - PROCESS | 1908 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:10:48 INFO - TEST-INFO | 1908: exit 0 13:10:48 INFO - Browser initialized. 13:10:48 INFO - Running cycle 1/1 for dromaeo_css test... 13:10:48 INFO - TEST-INFO | started process 1911 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/tmptbIHF1/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:11:00 INFO - PROCESS | 1911 | RSS: Main: 163246080 13:11:00 INFO - PROCESS | 1911 | 13:14:02 INFO - PROCESS | 1911 | Cycle 1(1): loaded http://localhost:49707/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49707/tests/dromaeo/cssquery-ext.html) 13:14:05 INFO - PROCESS | 1911 | RSS: Main: 260902912 13:14:05 INFO - PROCESS | 1911 | 13:17:08 INFO - PROCESS | 1911 | Cycle 1(1): loaded http://localhost:49707/tests/dromaeo/cssquery-ext.html (next: http://localhost:49707/tests/dromaeo/cssquery-jquery.html) 13:17:08 INFO - PROCESS | 1911 | RSS: Main: 303321088 13:17:08 INFO - PROCESS | 1911 | 13:20:10 INFO - PROCESS | 1911 | Cycle 1(1): loaded http://localhost:49707/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49707/tests/dromaeo/cssquery-mootools.html) 13:20:11 INFO - PROCESS | 1911 | RSS: Main: 282869760 13:20:11 INFO - PROCESS | 1911 | 13:23:13 INFO - PROCESS | 1911 | Cycle 1(1): loaded http://localhost:49707/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49707/tests/dromaeo/cssquery-prototype.html) 13:23:14 INFO - PROCESS | 1911 | RSS: Main: 274239488 13:23:14 INFO - PROCESS | 1911 | 13:26:17 INFO - PROCESS | 1911 | Cycle 1(1): loaded http://localhost:49707/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49707/tests/dromaeo/cssquery-yui.html) 13:26:18 INFO - PROCESS | 1911 | RSS: Main: 265232384 13:26:18 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | Cycle 1(1): loaded http://localhost:49707/tests/dromaeo/cssquery-yui.html (next: http://localhost:49707/tests/dromaeo/cssquery-dojo.html) 13:29:21 INFO - PROCESS | 1911 | RSS: Main: 448274432 13:29:21 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | __start_tp_report 13:29:21 INFO - PROCESS | 1911 | _x_x_mozilla_page_load 13:29:21 INFO - PROCESS | 1911 | _x_x_mozilla_page_load_details 13:29:21 INFO - PROCESS | 1911 | |i|pagename|runs| 13:29:21 INFO - PROCESS | 1911 | |0;dojo.html;2932.237618219263;3427.1432141964524;3458.5158077869105;3469.063352894717;3475.47867819827;5977.731002104905;5991.191189189458;6000.48995835354;6020.337762846083;6022.126791615213;6011.849703757408;6012;6097.268327800659;6098.756049758004;6102.87794244116;5350.866228344294;5364.356277246736;5417.566594672417;5442.619016668835;5478;5327.813526526573;5334.733263336837;5336.066188417011;5470.425605311445;5485.259489968843;5389.78440862365;5421.756020979065;5428.5928555358305;5432.456754324556;5434.510894019538;5400.513953744162;5402.621816472829;5423.349198096214;5424.864378390533;5429.891402171974;5290.100682883919;5373.435789242151;5380.838574842722;5385.596080293954;5393.352797664266;6062.120992456069;6064.514838812885;6065.8180254592435;6066.575339726221;6080.878382432326;6205.87588248237;6243.344448832898;6250.249970003629;6272.843178920518;6285.308616052231;6321.810345689637;6333.8416539586415;6346.397092276273;6349.079383489368;6366.458850997625;4894.2903279024695;6092.817215483543;6105.32841387447;6106.206193194901;6114.877702445926;6259.561830671809;6302.4958003359625;6313.968430157912;6428.71070801815;6473.28793832678;6281.183446151971;6284.057391391237;6299.055141728777;6319.9368006320265;6322.810315690536;6355.936440635627;6358.046293056079;6362.1093046973465;6362.713677884506;6364.236291644939;6293.527985401113;6295.622262664163;6297.653629050446;6300.117983482316;6309.873802524015;5819.73811178498;6176.567640265138;6214.533909956771;6247.625142491465;6270.874582508324;5162.251473536317;5175.094358487249;5179.61152913533;5180.326557547494;5193.818216362485;3543.982280088583;4497.370368148462;4608.446986361658;4622.445306563234;4639.257718764981;5854.297484301911;5883.0881213411985;5930.28836539618;5943.762249510058;5961.880762384728;6326.620402775849;6343.3339499351905;6346.587471814318;6354.523410744213;6357.682115894187;6007.639541627516;6012.977793775069;6022.45797878193;6034.426729460694;6075.027995520695;5546.278983732089;5564.638298510584;5605.971970140205;5623.6906970116215;5633;6297.086922396318;6299.779507717391;6339.809805705836;6350.587211831216;6366.681665916778;6316.11574379578;6334.841628959129;6343.9365606343345;6354.3963323484195;6360.9045864313;6374.872502549831;6393.360663933569;6421.7110230038825;6441.67791610427;6450.354964503512;6230.221222347207;6263.217097862767;6278.623282603058;6302.716377763103;6313.463355614824;5606.495415412633;6239.06414037898;6302.275238347465;6331.620102793847;6347.460465860454;6244.875102498016;6251.34360892118;6265.997440409695;6282.026285925689;6285.088662143872;6185;6232.940400131898;6279.686015699288;6323.051542268697;6326.2092238470195;6150.323464418821;6157.476614487819;6199.938000619936;6266.122742816101;6274.372562743689;6171.1668924694595;6288.654124023223;6293.748250069946;6306.211723534559;6307.526935479949;6118.710550942667;6121.602095863755;6125.388069147376;6177.598456100339;6206.565540412128 13:29:21 INFO - PROCESS | 1911 | |1;ext.html;489.84080173943477;497.97510124493766;527.064460582466;545.5035917315242;554.0138553374994;41588.79205603972;43146.137077258434;43160.35259471107;43251.91870203247;43329;44699.55300446995;45273.77363113188;45314.32028519575;45371.77314113425;45382.773086134526;9054.5020023899;9561.42631442114;9794.951025244864;9795.902040979607;9796.706098817047;9089.545522723838;11786.587469438571;11862.228955117933;12058.457369418396;12068.15522913392;11526.71183220422;11582.942085289604;11583.884161158365;11602.709932251677;11648.767024659503;11769.705757356049;11844.763104737944;11853.703657408547;11854.525818967231;11879.049676025897;11729.765404691858;11840.348780817052;11841.171118021743;11850.288982661068;11852.940735296355;43086.78456607728;43346.13307733859;43445.34831977523;43486.565134348566;43613;4099.528554216244;4110.486189226347;4112.09533902541;4116.6912481564;4134.607212314825;30388.8480557598;31771;32421.351572968408;32808;33486.6651333486;3235.498497732855;3429.0398688367295;3435.9656403435897;3456.5679290088738;3466.687998080185;488860;493784;494041;495786.521067396;497288;66338;66536.33463665398;66683.33316666869;66697.6665116681;66771;68950.65524672344;69205;69282;69426.65286673534;69454.30545694579;17138.914305428643;17857.46427607174;17874;17880.105994700214;17901.910490447724;12509.437075331633;12715.745685086247;13627.591172264847;13770;13778.724425511433;21339.25312614051;21825.890870545547;22398.32805015852;22447.214347498088;22479.438014049778;8787.560621968876;9032.683856065138;9065.456072635663;9069.82092327993;9100.8634870477;773.2615352338503;804.7505273365275;896.8385690575628;907.1336873285996;908.2688435809105;30574.69425305763;31713.20716982094;31881.68118318787;31889.840550797097;32252.516212256836;880.2869675562814;1068.5084860963889;1083.710384642273;1119.5633702855894;1234.9567765128177;16330;16532.669346613002;16562.254698538596;16698.99806011643;16833.242504087346;680494;687537;695014.5249273721;696267;700686.4965675139;66769.33230667729;67339;67397;67481;67551;1360.0683531780762;1404.669902572915;1471.71301596192;1518.9240537973058;1533.8312785593575;31437;33039.37448757224;33116.83441582777;33136.50295245621;33889.66110338865;47903.5209647899;54991.17513237225;55040.62398440071;55141;55303.89392212214;546798;546986;547284;548102;549037;38621.80689096537;39398;41719.58280417157;45390.092198155195;46364.30453543267;50812.491875082254;50840.74579627226;51286.743566281926;51545.7422712884;51670.74164629153;39367.606323936394;40379.788606341855;40437.79781101076;41164.382534261415;42766.14467710691;39868.800655996536;40515;41622.58377416308;41784;41889.16221675611;36752.63247367492;37133.88598342054;38191.236175275786;39202.215955680156;39526.40710389289;31897.36205275835;33671.494927575615;34216;34256.28718564012;34405.96782096541;25128.37179070538;25167.37081572902;25517.87241063783;25555.616665749658;26087.73912260853 13:29:21 INFO - PROCESS | 1911 | |2;jquery.html;333.55470446953314;403.89094944365024;410.21034508570995;415.45367841288703;439.25326944194876;15078.924605376986;19646.803531964677;20321.288754893583;20739.481512962164;20761.480962975933;19860.801391986075;22404.66393004106;22470.66294005587;22866.856657167158;23172.3048308551;5003.599712023039;6170.382961703838;6176.752929882799;6177.135201071854;6180.505559555248;4943.752812359386;6089.665068421235;6124.5100391968535;6172.876542469148;6199.287081985584;6155.815325540241;6160.938390616081;6165.475934545569;6177.135201071854;6179.2893817210925;5777.653340799523;5932.644041357532;5956.910646340287;6152.600080994744;6199.690015499207;5445.210444485567;6182.752689892399;6189.257289125334;6189.566730328879;6198.2252218472695;11409.48657310423;13910.860891391058;14088.295585220698;14116.788248176286;14129.434822607083;2568.58902575587;2674.6121812337296;2679.9866000670067;2726.209399274208;2733.5762956741737;9986.300958932878;10875.238733288674;11163;11408.71478213043;16809.41167059147;1685.4690772406775;1865.9923641233718;1866.2814816295825;1879.5676994291252;1895.4787433455772;135291;136881;144661;146121;147306;10411.802642696186;11997.580084696994;12181.756364872654;12221.816672749916;12273.57042503526;15922.96500727449;16147;16175.43385981485;16322.510324690278;16324.591885202964;9084.8637270441;9133.588988495534;9185.311101667401;9212;9274.258059355236;7371.88942165868;8971.013188549254;8984.595693193822;9139.086091390807;9162.541872906328;4885.291632713237;4891.6575839691595;4901.852944411673;4916.311716359713;4970.502949705001;2009.7186393904865;2056.4653190170366;2058.711780350752;2059.3718915730547;2062.102985201442;880.5641207602278;912.4707669551644;918.8851393575803;930.7393929699695;948.796008858085;21301.786982130292;22449.438764030703;22506.774932250795;22571.88714056419;22613.88693056524;770.6841686555246;801.9558924259222;925.2135684668112;955.8852937647526;962.8892677342195;10742.570297188026;11464.94267528657;11502;11516.596919107791;11528.942355288169;717832;730412;748654;765260;765723;123967;128273;148808;151420;154175;1045.4093437207953;1047.6333283350766;1069.059227879461;1069.9786004280027;1072.0565902006185;18481;19373.83756974586;19495.317663881695;19506.80493195107;19665;49764.75117624389;57844.71077644585;57954;58404;59454;75960.62019689866;79347.60326198333;82074;82837.57173538774;82971.0960116393;8388.958055209685;8498.70254541088;8567.785805354915;8958.283337333129;9086.45481271126;12711.682207944876;13301.933490332873;13563.525276615272;14235;14262.500812471513;11077.501512431798;11570.884291157317;11772.999295060015;11872.347020913932;12002.939985300018;11057.889421106007;11380.94309528447;11807.17349785541;11857.822132667845;11955.581554645894;11446.255993360404;11717.179797414099;11728.179027467995;12101.69745756363;12141.150119491904;8046.195380462141;8400.41197116196;8600.483970961763;8767.991680956771;8768.605412756313;11705.531778728755;11853.585124520945;11926.642200733992;12037.699057523632;12082.516699331929 13:29:21 INFO - PROCESS | 1911 | |3;mootools.html;1376.669599296168;1442.3365251984087;1447.8769304609107;1463.136749317903;1492.2315007770999;7564.621768911553;8227.38294627903;8474.067852536216;8478.57607119643;8519.488830670163;8303.709370172046;8375;8380.664773409071;8383.161683831613;8384.706535271267;2123.373604786592;2354.058376649341;2393.652920326552;2397.7841994220516;2402.8318017738766;2204.7574766775642;2320.8955596998176;2426.599611064172;2427.7936375408112;2433.5011322678806;2341.8711970841596;2379.298107058422;2383.2254517281867;2389.7610238976135;2393.9880300598475;2372.28831350595;2405.2423486601665;2405.2663937499055;2406.9518609627885;2409.8795060246916;2385.9284221473386;2402.783749462557;2432.1001229545004;2437.4881274932286;2441.3042282949273;8433.367497437655;8502.914970850274;8507.702230421906;8508.106648801848;8515.829683406297;5176.689398636094;5328.760205790749;5330.813421530228;5338.546223571001;5353.866153346197;3401.914952126192;3595.694365978895;3607.116256517144;3647.963520364789;3659.249853779995;1084.219362059316;1234.7407044520662;1272.6118533847173;1334.893208543324;1335.2522587351114;10715.732106697316;10834.40410777407;10944.23390362675;10963.232573719843;10981.780364392747;4522.140793249272;4708.529147085264;4745.430548334222;4804.735739534359;4821.951780482221;9645.758856028655;9650.93839677635;9661.275404344702;9667.129958303645;9671.274654400808;5373.865653358697;5375.113106337489;5382.623216374895;5383.138697808332;5386.461353864661;4484.686071974996;4793.400824896888;4844.975775121173;4880.682755620874;4938.160512712848;3346.263821959165;3798.4682144499793;4037.5760545142925;4104.651104656137;4115.629593336614;1307;1307.457405176841;1307.5554311534124;1318.5846458365584;1319.4458327502473;795.8249185179251;907.6460180529599;908.8046070094962;932.8647346134908;943.3396622364372;5582.720863956786;5621.915671264935;5740.885182296331;5771.59598828078;5791.218185544897;1007.6674697350004;1030.386919782728;1042.6393556408807;1054.446415631784;1056.894310568937;3646.4165733482514;3812.5996770338716;3821.178446633987;3892.202098569843;3967.7420967637013;9786.461744604116;10008.249381296431;10017.749556261151;10039.899601004043;10042.949785251172;9596.520173991272;9936.354136981074;9939.50302484873;9945.403275803475;9962.800743985079;7793.142754297023;7981.640826162837;7983.2415920487465;7986.920130798734;7992.960035199903;5712.571557133148;5768.596198266249;5783.450572195635;5797.2173756542325;6014.879702406015;7600.657970391235;9356.298277629341;9368.578413971523;9380.906190938003;9385.592161175879;9122.908770912207;9473.52632368365;9484.05159484046;9492.905070949479;9506.857397139187;5682.829515114553;6834.897476537955;6968.930310696828;6974.023636690766;6979.895301570582;7515.023047003854;7583.203763604742;7640.579768112585;7644.15914249421;7649.847003060019;6840.760573379908;7188.353048225685;7195.172555156224;7206.675699593426;7300.23347548521;7061.470389720895;7087.397571206505;7102.431805455654;7149.857002860018;7152.320529549685;5487.725613719218;6384.553081284451;6442.806715798533;6530.183727034121;6534.934650653623;4544.7500387479;4586.357909892685;4607.953920460753;4614.884627884329;4748.620110391092;5023.09584274834;5056.974715126548;5078.619103567174;5155.793768249228;5240.34495688039 13:29:21 INFO - PROCESS | 1911 | |4;prototype.html;369.1454283334081;372.5380528145099;380.8114983083373;381.3003139239497;384.23728898137176;5177.55990740787;5263.5261427129235;5313.57491400688;5338.519533242007;5345.151490926536;4111.848682368934;5022.522860328272;5156.407013193484;5202.505761952609;5220.243064755608;3711.42472916697;3808.6191380861833;4051.7771522566172;4110;4179.519355274137;3646.8665830489194;3650.671439570438;3829.6936245100464;4031.951692559941;4175.728577642459;3500.6149323574386;3647.2340808430263;4176.582341765829;4184.363850774008;4211.5788421157795;3559.57285125784;3572.998241968998;4129.91740165198;4141.627253547165;4191.580841915799;3228.4350238708366;3314.6188188358406;3592.2276710507367;3688.2254726507467;3736.23407201523;4372.846950356754;4886.560209581119;5063.139266324733;5142.871428214287;5189.195674670432;3529.000349702758;4504.1892459357305;4615.930761038587;4819.638527110481;4831.323614693945;4794.113089078532;5202.895942081175;5227.26818245446;5473.698946557938;5620.9437905621235;3308.718758905496;3933.328335457419;3941.921161576752;3970.463987361698;3971;4290.156881836887;5454.209139674725;5538.446155384429;5917.260342457193;5917.822465326047;3799.35410980134;3865.9226815463535;3956.208758248362;3970.0273433009097;3984.6812255019527;3544.61009288978;3795.7853486884483;3808.924136345698;3987.5414327352146;4019.959800402017;4084.630914069832;4342.457192850894;4477.462704475483;4560.498345182027;4682.601978831837;5576.553875689935;5580.19087232349;5600.299962504687;5611.80358687444;5623.943760562423;1282.2883299768719;1292.9094963352475;1295;1297.5782870567105;1301.5444594391888;806.3106044332012;827.6772058897035;831.5218749219102;881.5592203898051;890.799570096736;4604.447466304065;4820.493848145964;4829.913269514402;4860.930595269035;4966.491921579579;4844.442889067732;4908.282101264529;4911.9754401227765;5436.70098144598;5464.453554644504;4378.211921854033;4666.906661866744;4714.363560919301;4807.78364973577;4808.663393562487;2849.891080600341;2854.414844956779;2874.726900944407;2887.797854150231;2915.329474220941;4850.7817148227705;5451.155070964007;5535.944640553543;5548.805791797348;5605.7197140142825;4567.200739870509;4783.823360371023;5023.748812559357;5213.7914483421;5594.0769772987815;5503.697296648723;5579.553635709133;5625.324961004624;5646.543753467255;5659.293162978256;4597.563231493003;4720.480747117883;4756.6908150970075;5185.714785686672;5385.8922821542565;4591.908161836812;5094.745262736922;5363.973180134074;5414.3232095988005;5481.780728770964;4715.764211789466;5348.806989134436;5661.499108208902;5708.343540492897;5804.1874137619925;3384.967584886633;3614.4578313253223;3859.26673931952;3975.6819454443;3983.6813054956115;5807.245058142415;5826.73779679907;5828.533717302521;5842.561807864342;5854.121881717776;4486.945567791631;5265.657732247391;5471.72641367922;5530.336359636708;5631.8592035199445;4966.428860681068;5061.785766038518;5088;5618.69097199658;5663.32040155184;4896.143174944442;5237.900040991434;5498.367687715964;5517.724113794214;5526.41972592888;4665.034720487559;5219.660722053054;5547.973624879411;5566.471185237396;5602.439756024365;4763.903462749102;5192.45479224676;5215.973920130375;5483.341998960151;5509.393966663583 13:29:21 INFO - PROCESS | 1911 | |5;yui.html;676.5162908520407;687.2062767503533;753.6043577122007;768.19339693322;786.476992799788;15063.849361506382;15160.317785699628;15610.609734756637;15644.296006679699;15784.842151578481;14287.499937502189;14472.855271447283;14615.123092614424;14727.558173254793;14754.483593074245;903.4714691905227;924.4869097650801;925.0934084597098;926.1294383279695;931.6320053578833;732.8241222106683;756.4477931110292;899.2176806178601;910.6129894794719;920.5673333533229;968.8498282766147;969.92725545584;977.1108291454777;977.569869257528;982.6462473509531;971.6016433262364;973.245734555718;973.5570315506427;973.9805203895883;976.4531862157179;724.6775185042658;725.2928394815013;728.0353531570637;728.7631519756047;730.9853802923911;15005.174715390649;15146;15151.696966060617;15281.694366112726;15882.602934926605;14544.709105817825;14715.779263311058;14717.190554519497;14739.410423583044;14798.112113273239;11425.942870285595;11640.708982275426;11656.592019279284;11827.94086029573;11874.346910919896;3717.5910649828497;3872.9419058714143;3879.534455865286;3902;3935.094928166509;107873;111206.88793112047;112441.75116497625;112906.43546782213;112973;11145.2198346115;11189.160812938899;11316.745765404476;11624.011958983412;11624.767504650028;17879.195436205402;20103.798962010194;23203.071877124727;23453.530929381315;23620.645690314657;6976.965115174392;7854.764357069297;7904.486208396436;8069.386122775469;8315.293200078062;4367.737935723867;4391.407160033418;4505.977470112629;4577.931331030038;4608.608268297232;3562.1450851795385;3584.766990145632;3613.367660659374;3617.077645200457;3641.1443310821937;683.9145106861642;687.2131409536054;692.6190595172635;699.8110510162228;701.2496628607341;662.2648859765657;665.262114264469;669.2537820330297;694.2224708326706;696.2445746365149;9856.016626532532;10303.896961030443;10326.733365983402;10544.578216871392;10706.089982351432;648.4747354642755;654.195851125712;696.2584847137782;696.627304392158;708.787363790871;4948.975255123702;5019.698818070928;5035.244713292962;5035.269885866529;5041.395032596112;94257;102411.97588024025;109942.45028774806;112515.43742281236;112551.31173032412;70541.6472917632;71085.64457177681;72008.91986620205;78237.82643260356;96343.55484667736;54022.45977540253;61575.384246158756;63870;67846.66076669584;69734.65132674406;10956.56173753041;10978.615748448767;11025.724356891142;11349.943250284026;11418.543258269576;31220;43411.78294108509;43803.56196437995;45051.549484506046;45331.54668453273;54405.45594544004;57028.71485642545;58789.41210587839;60870.69564652148;65089;13658;13695.931520342334;13744.381502832597;13807.378667959765;13934.30328483592;15226;15321.923390382977;15336.233188340762;15567.299471523582;15918.7612185815;13871.653208669864;14269.857301426853;14650.853491464948;14661.04703194289;14801.777973330623;12234.021278297892;13692.726145477234;14027.649308766955;14482.855171448151;14975.475858344906;13776.448942042207;14016.369263382969;14263.857361426253;14267.42930282777;14763.261836908327;10775.191860610643;10909.236353455499;11042.558297668003;11046.502907369028;11441.14191435629;8714.389992700704;9268;11524.82712759326;11546.480408381474;11934.761304774029 13:29:21 INFO - PROCESS | 1911 | __end_tp_report 13:29:21 INFO - PROCESS | 1911 | __start_cc_report 13:29:21 INFO - PROCESS | 1911 | _x_x_mozilla_cycle_collect,2097 13:29:21 INFO - PROCESS | 1911 | __end_cc_report 13:29:21 INFO - PROCESS | 1911 | __startTimestamp1489008561413__endTimestamp 13:29:21 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | ------- Summary: start ------- 13:29:21 INFO - PROCESS | 1911 | Number of tests: 6 13:29:21 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | [#0] dojo.html Cycles:165 Average:5895.72 Median:6171.17 stddev:655.36 (10.6%) stddev-sans-first:614.76 13:29:21 INFO - PROCESS | 1911 | Values: 2932.2 3427.1 3458.5 3469.1 3475.5 5977.7 5991.2 6000.5 6020.3 6022.1 6011.8 6012.0 6097.3 6098.8 6102.9 5350.9 5364.4 5417.6 5442.6 5478.0 5327.8 5334.7 5336.1 5470.4 5485.3 5389.8 5421.8 5428.6 5432.5 5434.5 5400.5 5402.6 5423.3 5424.9 5429.9 5290.1 5373.4 5380.8 5385.6 5393.4 6062.1 6064.5 6065.8 6066.6 6080.9 6205.9 6243.3 6250.2 6272.8 6285.3 6321.8 6333.8 6346.4 6349.1 6366.5 4894.3 6092.8 6105.3 6106.2 6114.9 6259.6 6302.5 6314.0 6428.7 6473.3 6281.2 6284.1 6299.1 6319.9 6322.8 6355.9 6358.0 6362.1 6362.7 6364.2 6293.5 6295.6 6297.7 6300.1 6309.9 5819.7 6176.6 6214.5 6247.6 6270.9 5162.3 5175.1 5179.6 5180.3 5193.8 3544.0 4497.4 4608.4 4622.4 4639.3 5854.3 5883.1 5930.3 5943.8 5961.9 6326.6 6343.3 6346.6 6354.5 6357.7 6007.6 6013.0 6022.5 6034.4 6075.0 5546.3 5564.6 5606.0 5623.7 5633.0 6297.1 6299.8 6339.8 6350.6 6366.7 6316.1 6334.8 6343.9 6354.4 6360.9 6374.9 6393.4 6421.7 6441.7 6450.4 6230.2 6263.2 6278.6 6302.7 6313.5 5606.5 6239.1 6302.3 6331.6 6347.5 6244.9 6251.3 6266.0 6282.0 6285.1 6185.0 6232.9 6279.7 6323.1 6326.2 6150.3 6157.5 6199.9 6266.1 6274.4 6171.2 6288.7 6293.7 6306.2 6307.5 6118.7 6121.6 6125.4 6177.6 6206.6 13:29:21 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | [#1] ext.html Cycles:180 Average:73275.29 Median:4105.01 stddev:155720.35 (3793.4%) stddev-sans-first:156061.30 13:29:21 INFO - PROCESS | 1911 | Values: 489.8 498.0 527.1 545.5 554.0 41588.8 43146.1 43160.4 43251.9 43329.0 44699.6 45273.8 45314.3 45371.8 45382.8 9054.5 9561.4 9795.0 9795.9 9796.7 9089.5 11786.6 11862.2 12058.5 12068.2 11526.7 11582.9 11583.9 11602.7 11648.8 11769.7 11844.8 11853.7 11854.5 11879.0 11729.8 11840.3 11841.2 11850.3 11852.9 43086.8 43346.1 43445.3 43486.6 43613.0 4099.5 4110.5 4112.1 4116.7 4134.6 30388.8 31771.0 32421.4 32808.0 33486.7 3235.5 3429.0 3436.0 3456.6 3466.7 488860.0 493784.0 494041.0 495786.5 497288.0 66338.0 66536.3 66683.3 66697.7 66771.0 68950.7 69205.0 69282.0 69426.7 69454.3 17138.9 17857.5 17874.0 17880.1 17901.9 12509.4 12715.7 13627.6 13770.0 13778.7 21339.3 21825.9 22398.3 22447.2 22479.4 8787.6 9032.7 9065.5 9069.8 9100.9 773.3 804.8 896.8 907.1 908.3 30574.7 31713.2 31881.7 31889.8 32252.5 880.3 1068.5 1083.7 1119.6 1235.0 16330.0 16532.7 16562.3 16699.0 16833.2 680494.0 687537.0 695014.5 696267.0 700686.5 66769.3 67339.0 67397.0 67481.0 67551.0 1360.1 1404.7 1471.7 1518.9 1533.8 31437.0 33039.4 33116.8 33136.5 33889.7 47903.5 54991.2 55040.6 55141.0 55303.9 546798.0 546986.0 547284.0 548102.0 549037.0 38621.8 39398.0 41719.6 45390.1 46364.3 50812.5 50840.7 51286.7 51545.7 51670.7 39367.6 40379.8 40437.8 41164.4 42766.1 39868.8 40515.0 41622.6 41784.0 41889.2 36752.6 37133.9 38191.2 39202.2 39526.4 31897.4 33671.5 34216.0 34256.3 34406.0 25128.4 25167.4 25517.9 25555.6 26087.7 13:29:21 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | [#2] jquery.html Cycles:180 Average:40411.64 Median:22592.89 stddev:124105.84 (549.3%) stddev-sans-first:124417.50 13:29:21 INFO - PROCESS | 1911 | Values: 333.6 403.9 410.2 415.5 439.3 15078.9 19646.8 20321.3 20739.5 20761.5 19860.8 22404.7 22470.7 22866.9 23172.3 5003.6 6170.4 6176.8 6177.1 6180.5 4943.8 6089.7 6124.5 6172.9 6199.3 6155.8 6160.9 6165.5 6177.1 6179.3 5777.7 5932.6 5956.9 6152.6 6199.7 5445.2 6182.8 6189.3 6189.6 6198.2 11409.5 13910.9 14088.3 14116.8 14129.4 2568.6 2674.6 2680.0 2726.2 2733.6 9986.3 10875.2 11163.0 11408.7 16809.4 1685.5 1866.0 1866.3 1879.6 1895.5 135291.0 136881.0 144661.0 146121.0 147306.0 10411.8 11997.6 12181.8 12221.8 12273.6 15923.0 16147.0 16175.4 16322.5 16324.6 9084.9 9133.6 9185.3 9212.0 9274.3 7371.9 8971.0 8984.6 9139.1 9162.5 4885.3 4891.7 4901.9 4916.3 4970.5 2009.7 2056.5 2058.7 2059.4 2062.1 880.6 912.5 918.9 930.7 948.8 21301.8 22449.4 22506.8 22571.9 22613.9 770.7 802.0 925.2 955.9 962.9 10742.6 11464.9 11502.0 11516.6 11528.9 717832.0 730412.0 748654.0 765260.0 765723.0 123967.0 128273.0 148808.0 151420.0 154175.0 1045.4 1047.6 1069.1 1070.0 1072.1 18481.0 19373.8 19495.3 19506.8 19665.0 49764.8 57844.7 57954.0 58404.0 59454.0 75960.6 79347.6 82074.0 82837.6 82971.1 8389.0 8498.7 8567.8 8958.3 9086.5 12711.7 13301.9 13563.5 14235.0 14262.5 11077.5 11570.9 11773.0 11872.3 12002.9 11057.9 11380.9 11807.2 11857.8 11955.6 11446.3 11717.2 11728.2 12101.7 12141.2 8046.2 8400.4 8600.5 8768.0 8768.6 11705.5 11853.6 11926.6 12037.7 12082.5 13:29:21 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | [#3] mootools.html Cycles:180 Average:5480.49 Median:5329.79 stddev:2943.81 (55.2%) stddev-sans-first:2935.91 13:29:21 INFO - PROCESS | 1911 | Values: 1376.7 1442.3 1447.9 1463.1 1492.2 7564.6 8227.4 8474.1 8478.6 8519.5 8303.7 8375.0 8380.7 8383.2 8384.7 2123.4 2354.1 2393.7 2397.8 2402.8 2204.8 2320.9 2426.6 2427.8 2433.5 2341.9 2379.3 2383.2 2389.8 2394.0 2372.3 2405.2 2405.3 2407.0 2409.9 2385.9 2402.8 2432.1 2437.5 2441.3 8433.4 8502.9 8507.7 8508.1 8515.8 5176.7 5328.8 5330.8 5338.5 5353.9 3401.9 3595.7 3607.1 3648.0 3659.2 1084.2 1234.7 1272.6 1334.9 1335.3 10715.7 10834.4 10944.2 10963.2 10981.8 4522.1 4708.5 4745.4 4804.7 4822.0 9645.8 9650.9 9661.3 9667.1 9671.3 5373.9 5375.1 5382.6 5383.1 5386.5 4484.7 4793.4 4845.0 4880.7 4938.2 3346.3 3798.5 4037.6 4104.7 4115.6 1307.0 1307.5 1307.6 1318.6 1319.4 795.8 907.6 908.8 932.9 943.3 5582.7 5621.9 5740.9 5771.6 5791.2 1007.7 1030.4 1042.6 1054.4 1056.9 3646.4 3812.6 3821.2 3892.2 3967.7 9786.5 10008.2 10017.7 10039.9 10042.9 9596.5 9936.4 9939.5 9945.4 9962.8 7793.1 7981.6 7983.2 7986.9 7993.0 5712.6 5768.6 5783.5 5797.2 6014.9 7600.7 9356.3 9368.6 9380.9 9385.6 9122.9 9473.5 9484.1 9492.9 9506.9 5682.8 6834.9 6968.9 6974.0 6979.9 7515.0 7583.2 7640.6 7644.2 7649.8 6840.8 7188.4 7195.2 7206.7 7300.2 7061.5 7087.4 7102.4 7149.9 7152.3 5487.7 6384.6 6442.8 6530.2 6534.9 4544.8 4586.4 4608.0 4614.9 4748.6 5023.1 5057.0 5078.6 5155.8 5240.3 13:29:21 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | [#4] prototype.html Cycles:180 Average:4410.23 Median:4830.62 stddev:1322.31 (27.4%) stddev-sans-first:1290.76 13:29:21 INFO - PROCESS | 1911 | Values: 369.1 372.5 380.8 381.3 384.2 5177.6 5263.5 5313.6 5338.5 5345.2 4111.8 5022.5 5156.4 5202.5 5220.2 3711.4 3808.6 4051.8 4110.0 4179.5 3646.9 3650.7 3829.7 4032.0 4175.7 3500.6 3647.2 4176.6 4184.4 4211.6 3559.6 3573.0 4129.9 4141.6 4191.6 3228.4 3314.6 3592.2 3688.2 3736.2 4372.8 4886.6 5063.1 5142.9 5189.2 3529.0 4504.2 4615.9 4819.6 4831.3 4794.1 5202.9 5227.3 5473.7 5620.9 3308.7 3933.3 3941.9 3970.5 3971.0 4290.2 5454.2 5538.4 5917.3 5917.8 3799.4 3865.9 3956.2 3970.0 3984.7 3544.6 3795.8 3808.9 3987.5 4020.0 4084.6 4342.5 4477.5 4560.5 4682.6 5576.6 5580.2 5600.3 5611.8 5623.9 1282.3 1292.9 1295.0 1297.6 1301.5 806.3 827.7 831.5 881.6 890.8 4604.4 4820.5 4829.9 4860.9 4966.5 4844.4 4908.3 4912.0 5436.7 5464.5 4378.2 4666.9 4714.4 4807.8 4808.7 2849.9 2854.4 2874.7 2887.8 2915.3 4850.8 5451.2 5535.9 5548.8 5605.7 4567.2 4783.8 5023.7 5213.8 5594.1 5503.7 5579.6 5625.3 5646.5 5659.3 4597.6 4720.5 4756.7 5185.7 5385.9 4591.9 5094.7 5364.0 5414.3 5481.8 4715.8 5348.8 5661.5 5708.3 5804.2 3385.0 3614.5 3859.3 3975.7 3983.7 5807.2 5826.7 5828.5 5842.6 5854.1 4486.9 5265.7 5471.7 5530.3 5631.9 4966.4 5061.8 5088.0 5618.7 5663.3 4896.1 5237.9 5498.4 5517.7 5526.4 4665.0 5219.7 5548.0 5566.5 5602.4 4763.9 5192.5 5216.0 5483.3 5509.4 13:29:21 INFO - PROCESS | 1911 | 13:29:21 INFO - PROCESS | 1911 | [#5] yui.html Cycles:180 Average:19765.52 Median:3629.11 stddev:28203.87 (777.2%) stddev-sans-first:28246.56 13:29:21 INFO - PROCESS | 1911 | Values: 676.5 687.2 753.6 768.2 786.5 15063.8 15160.3 15610.6 15644.3 15784.8 14287.5 14472.9 14615.1 14727.6 14754.5 903.5 924.5 925.1 926.1 931.6 732.8 756.4 899.2 910.6 920.6 968.8 969.9 977.1 977.6 982.6 971.6 973.2 973.6 974.0 976.5 724.7 725.3 728.0 728.8 731.0 15005.2 15146.0 15151.7 15281.7 15882.6 14544.7 14715.8 14717.2 14739.4 14798.1 11425.9 11640.7 11656.6 11827.9 11874.3 3717.6 3872.9 3879.5 3902.0 3935.1 107873.0 111206.9 112441.8 112906.4 112973.0 11145.2 11189.2 11316.7 11624.0 11624.8 17879.2 20103.8 23203.1 23453.5 23620.6 6977.0 7854.8 7904.5 8069.4 8315.3 4367.7 4391.4 4506.0 4577.9 4608.6 3562.1 3584.8 3613.4 3617.1 3641.1 683.9 687.2 692.6 699.8 701.2 662.3 665.3 669.3 694.2 696.2 9856.0 10303.9 10326.7 10544.6 10706.1 648.5 654.2 696.3 696.6 708.8 4949.0 5019.7 5035.2 5035.3 5041.4 94257.0 102412.0 109942.5 112515.4 112551.3 70541.6 71085.6 72008.9 78237.8 96343.6 54022.5 61575.4 63870.0 67846.7 69734.7 10956.6 10978.6 11025.7 11349.9 11418.5 31220.0 43411.8 43803.6 45051.5 45331.5 54405.5 57028.7 58789.4 60870.7 65089.0 13658.0 13695.9 13744.4 13807.4 13934.3 15226.0 15321.9 15336.2 15567.3 15918.8 13871.7 14269.9 14650.9 14661.0 14801.8 12234.0 13692.7 14027.6 14482.9 14975.5 13776.4 14016.4 14263.9 14267.4 14763.3 10775.2 10909.2 11042.6 11046.5 11441.1 8714.4 9268.0 11524.8 11546.5 11934.8 13:29:21 INFO - PROCESS | 1911 | -------- Summary: end -------- 13:29:21 INFO - PROCESS | 1911 | 13:29:22 INFO - TEST-INFO | 1911: exit 0 13:29:22 INFO - TEST-OK | dromaeo_css | took 1116680ms 13:29:22 INFO - TEST-START | kraken 13:29:22 INFO - operating with platform_type : mac_ 13:29:22 INFO - Initialising browser for kraken test... 13:29:22 INFO - TEST-INFO | started process 1915 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/tmplMTJcY/profile http://localhost:49707/getInfo.html) 13:29:24 INFO - PROCESS | 1915 | __metrics Screen width/height:1600/1200 13:29:24 INFO - PROCESS | 1915 | colorDepth:24 13:29:24 INFO - PROCESS | 1915 | Browser inner width/height: 1024/689 13:29:24 INFO - PROCESS | 1915 | __metrics 13:29:24 INFO - PROCESS | 1915 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:29:24 INFO - PROCESS | 1915 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:29:24 INFO - TEST-INFO | 1915: exit 0 13:29:24 INFO - Browser initialized. 13:29:24 INFO - Running cycle 1/1 for kraken test... 13:29:24 INFO - TEST-INFO | started process 1917 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/gh/t76btwz501jcblhsxv28_zf400000w/T/tmplMTJcY/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:29:36 INFO - PROCESS | 1917 | RSS: Main: 163426304 13:29:36 INFO - PROCESS | 1917 | 13:29:39 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49707/tests/kraken/driver.html?testName=audio-beat-detection) 13:29:40 INFO - PROCESS | 1917 | RSS: Main: 214323200 13:29:40 INFO - PROCESS | 1917 | 13:29:42 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49707/tests/kraken/driver.html?testName=audio-dft) 13:29:43 INFO - PROCESS | 1917 | RSS: Main: 229666816 13:29:43 INFO - PROCESS | 1917 | 13:29:46 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49707/tests/kraken/driver.html?testName=audio-fft) 13:29:47 INFO - PROCESS | 1917 | RSS: Main: 326119424 13:29:47 INFO - PROCESS | 1917 | 13:29:49 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49707/tests/kraken/driver.html?testName=audio-oscillator) 13:29:49 INFO - PROCESS | 1917 | RSS: Main: 229330944 13:29:49 INFO - PROCESS | 1917 | 13:29:51 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49707/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:29:52 INFO - PROCESS | 1917 | RSS: Main: 231108608 13:29:52 INFO - PROCESS | 1917 | 13:29:55 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49707/tests/kraken/driver.html?testName=imaging-darkroom) 13:29:55 INFO - PROCESS | 1917 | RSS: Main: 271745024 13:29:55 INFO - PROCESS | 1917 | 13:29:58 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49707/tests/kraken/driver.html?testName=imaging-desaturate) 13:29:59 INFO - PROCESS | 1917 | RSS: Main: 271360000 13:29:59 INFO - PROCESS | 1917 | 13:30:02 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49707/tests/kraken/driver.html?testName=json-parse-financial) 13:30:02 INFO - PROCESS | 1917 | RSS: Main: 268505088 13:30:02 INFO - PROCESS | 1917 | 13:30:04 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49707/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:30:04 INFO - PROCESS | 1917 | RSS: Main: 245579776 13:30:04 INFO - PROCESS | 1917 | 13:30:06 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49707/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:30:07 INFO - PROCESS | 1917 | RSS: Main: 248852480 13:30:07 INFO - PROCESS | 1917 | 13:30:09 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49707/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:30:10 INFO - PROCESS | 1917 | RSS: Main: 257101824 13:30:10 INFO - PROCESS | 1917 | 13:30:12 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49707/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:30:13 INFO - PROCESS | 1917 | RSS: Main: 269910016 13:30:13 INFO - PROCESS | 1917 | 13:30:16 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49707/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:30:17 INFO - PROCESS | 1917 | RSS: Main: 264372224 13:30:17 INFO - PROCESS | 1917 | 13:30:18 INFO - PROCESS | 1917 | Cycle 1(1): loaded http://localhost:49707/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49707/tests/kraken/driver.html?testName=ai-astar) 13:30:19 INFO - PROCESS | 1917 | RSS: Main: 308981760 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | __start_tp_report 13:30:19 INFO - PROCESS | 1917 | _x_x_mozilla_page_load 13:30:19 INFO - PROCESS | 1917 | _x_x_mozilla_page_load_details 13:30:19 INFO - PROCESS | 1917 | |i|pagename|runs| 13:30:19 INFO - PROCESS | 1917 | |0;ai-astar;103;115;114;115;114;115;114;112;113;116 13:30:19 INFO - PROCESS | 1917 | |1;audio-beat-detection;145;108;109;145;109;110;109;108;128;107 13:30:19 INFO - PROCESS | 1917 | |2;audio-dft;184;184;184;183;185;184;184;183;184;184 13:30:19 INFO - PROCESS | 1917 | |3;audio-fft;81;58;58;89;58;81;49;78;86;79 13:30:19 INFO - PROCESS | 1917 | |4;audio-oscillator;84;69;85;69;67;68;81;67;68;81 13:30:19 INFO - PROCESS | 1917 | |5;imaging-gaussian-blur;88;85;89;85;87;84;89;86;88;85 13:30:19 INFO - PROCESS | 1917 | |6;imaging-darkroom;92;92;93;93;93;93;101;146;92;93 13:30:19 INFO - PROCESS | 1917 | |7;imaging-desaturate;85;88;87;84;86;87;86;86;84;85 13:30:19 INFO - PROCESS | 1917 | |8;json-parse-financial;56;50;51;53;54;55;55;55;56;55 13:30:19 INFO - PROCESS | 1917 | |9;json-stringify-tinderbox;64;64;78;75;70;71;67;68;65;91 13:30:19 INFO - PROCESS | 1917 | |10;stanford-crypto-aes;84;83;85;82;82;81;80;80;88;86 13:30:19 INFO - PROCESS | 1917 | |11;stanford-crypto-ccm;136;131;133;143;129;138;132;147;182;143 13:30:19 INFO - PROCESS | 1917 | |12;stanford-crypto-pbkdf2;162;163;162;161;163;161;168;216;192;162 13:30:19 INFO - PROCESS | 1917 | |13;stanford-crypto-sha256-iterative;64;65;64;64;64;63;64;63;63;63 13:30:19 INFO - PROCESS | 1917 | __end_tp_report 13:30:19 INFO - PROCESS | 1917 | __start_cc_report 13:30:19 INFO - PROCESS | 1917 | _x_x_mozilla_cycle_collect,1967 13:30:19 INFO - PROCESS | 1917 | __end_cc_report 13:30:19 INFO - PROCESS | 1917 | __startTimestamp1489008619132__endTimestamp 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | ------- Summary: start ------- 13:30:19 INFO - PROCESS | 1917 | Number of tests: 14 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#0] ai-astar Cycles:10 Average:113.10 Median:114.50 stddev:3.73 (3.3%) stddev-sans-first:1.20 13:30:19 INFO - PROCESS | 1917 | Values: 103.0 115.0 114.0 115.0 114.0 115.0 114.0 112.0 113.0 116.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#1] audio-beat-detection Cycles:10 Average:117.80 Median:109.50 stddev:15.58 (14.2%) stddev-sans-first:13.06 13:30:19 INFO - PROCESS | 1917 | Values: 145.0 108.0 109.0 145.0 109.0 110.0 109.0 108.0 128.0 107.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#2] audio-dft Cycles:10 Average:183.90 Median:184.00 stddev:0.57 (0.3%) stddev-sans-first:0.60 13:30:19 INFO - PROCESS | 1917 | Values: 184.0 184.0 184.0 183.0 185.0 184.0 184.0 183.0 184.0 184.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#3] audio-fft Cycles:10 Average:71.70 Median:80.00 stddev:14.33 (17.9%) stddev-sans-first:14.80 13:30:19 INFO - PROCESS | 1917 | Values: 81.0 58.0 58.0 89.0 58.0 81.0 49.0 78.0 86.0 79.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#4] audio-oscillator Cycles:10 Average:73.90 Median:75.00 stddev:7.74 (10.3%) stddev-sans-first:7.29 13:30:19 INFO - PROCESS | 1917 | Values: 84.0 69.0 85.0 69.0 67.0 68.0 81.0 67.0 68.0 81.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#5] imaging-gaussian-blur Cycles:10 Average:86.60 Median:87.50 stddev:1.84 (2.1%) stddev-sans-first:1.88 13:30:19 INFO - PROCESS | 1917 | Values: 88.0 85.0 89.0 85.0 87.0 84.0 89.0 86.0 88.0 85.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#6] imaging-darkroom Cycles:10 Average:98.80 Median:93.00 stddev:16.80 (18.1%) stddev-sans-first:17.64 13:30:19 INFO - PROCESS | 1917 | Values: 92.0 92.0 93.0 93.0 93.0 93.0 101.0 146.0 92.0 93.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#7] imaging-desaturate Cycles:10 Average:85.80 Median:86.00 stddev:1.32 (1.5%) stddev-sans-first:1.36 13:30:19 INFO - PROCESS | 1917 | Values: 85.0 88.0 87.0 84.0 86.0 87.0 86.0 86.0 84.0 85.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#8] json-parse-financial Cycles:10 Average:54.00 Median:55.00 stddev:2.05 (3.7%) stddev-sans-first:2.05 13:30:19 INFO - PROCESS | 1917 | Values: 56.0 50.0 51.0 53.0 54.0 55.0 55.0 55.0 56.0 55.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#9] json-stringify-tinderbox Cycles:10 Average:71.30 Median:70.50 stddev:8.33 (11.8%) stddev-sans-first:8.40 13:30:19 INFO - PROCESS | 1917 | Values: 64.0 64.0 78.0 75.0 70.0 71.0 67.0 68.0 65.0 91.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#10] stanford-crypto-aes Cycles:10 Average:83.10 Median:83.50 stddev:2.64 (3.2%) stddev-sans-first:2.78 13:30:19 INFO - PROCESS | 1917 | Values: 84.0 83.0 85.0 82.0 82.0 81.0 80.0 80.0 88.0 86.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#11] stanford-crypto-ccm Cycles:10 Average:141.40 Median:140.50 stddev:15.44 (11.0%) stddev-sans-first:16.26 13:30:19 INFO - PROCESS | 1917 | Values: 136.0 131.0 133.0 143.0 129.0 138.0 132.0 147.0 182.0 143.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.00 Median:163.00 stddev:18.40 (11.3%) stddev-sans-first:19.22 13:30:19 INFO - PROCESS | 1917 | Values: 162.0 163.0 162.0 161.0 163.0 161.0 168.0 216.0 192.0 162.0 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - PROCESS | 1917 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.70 Median:64.00 stddev:0.67 (1.1%) stddev-sans-first:0.71 13:30:19 INFO - PROCESS | 1917 | Values: 64.0 65.0 64.0 64.0 64.0 63.0 64.0 63.0 63.0 63.0 13:30:19 INFO - PROCESS | 1917 | -------- Summary: end -------- 13:30:19 INFO - PROCESS | 1917 | 13:30:19 INFO - TEST-INFO | 1917: exit 0 13:30:19 INFO - TEST-OK | kraken | took 57958ms 13:30:19 INFO - SUITE-END | took 1174s 13:30:20 INFO - Completed test suite (00:19:34) 13:30:20 INFO - javascript benchmark 13:30:20 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2932.237618219263, 3427.1432141964524, 3458.5158077869105, 3469.063352894717, 3475.47867819827, 5977.731002104905, 5991.191189189458, 6000.48995835354, 6020.337762846083, 6022.126791615213, 6011.849703757408, 6012.0, 6097.268327800659, 6098.756049758004, 6102.87794244116, 5350.866228344294, 5364.356277246736, 5417.566594672417, 5442.619016668835, 5478.0, 5327.813526526573, 5334.733263336837, 5336.066188417011, 5470.425605311445, 5485.259489968843, 5389.78440862365, 5421.756020979065, 5428.5928555358305, 5432.456754324556, 5434.510894019538, 5400.513953744162, 5402.621816472829, 5423.349198096214, 5424.864378390533, 5429.891402171974, 5290.100682883919, 5373.435789242151, 5380.838574842722, 5385.596080293954, 5393.352797664266, 6062.120992456069, 6064.514838812885, 6065.8180254592435, 6066.575339726221, 6080.878382432326, 6205.87588248237, 6243.344448832898, 6250.249970003629, 6272.843178920518, 6285.308616052231, 6321.810345689637, 6333.8416539586415, 6346.397092276273, 6349.079383489368, 6366.458850997625, 4894.2903279024695, 6092.817215483543, 6105.32841387447, 6106.206193194901, 6114.877702445926, 6259.561830671809, 6302.4958003359625, 6313.968430157912, 6428.71070801815, 6473.28793832678, 6281.183446151971, 6284.057391391237, 6299.055141728777, 6319.9368006320265, 6322.810315690536, 6355.936440635627, 6358.046293056079, 6362.1093046973465, 6362.713677884506, 6364.236291644939, 6293.527985401113, 6295.622262664163, 6297.653629050446, 6300.117983482316, 6309.873802524015, 5819.73811178498, 6176.567640265138, 6214.533909956771, 6247.625142491465, 6270.874582508324, 5162.251473536317, 5175.094358487249, 5179.61152913533, 5180.326557547494, 5193.818216362485, 3543.982280088583, 4497.370368148462, 4608.446986361658, 4622.445306563234, 4639.257718764981, 5854.297484301911, 5883.0881213411985, 5930.28836539618, 5943.762249510058, 5961.880762384728, 6326.620402775849, 6343.3339499351905, 6346.587471814318, 6354.523410744213, 6357.682115894187, 6007.639541627516, 6012.977793775069, 6022.45797878193, 6034.426729460694, 6075.027995520695, 5546.278983732089, 5564.638298510584, 5605.971970140205, 5623.6906970116215, 5633.0, 6297.086922396318, 6299.779507717391, 6339.809805705836, 6350.587211831216, 6366.681665916778, 6316.11574379578, 6334.841628959129, 6343.9365606343345, 6354.3963323484195, 6360.9045864313, 6374.872502549831, 6393.360663933569, 6421.7110230038825, 6441.67791610427, 6450.354964503512, 6230.221222347207, 6263.217097862767, 6278.623282603058, 6302.716377763103, 6313.463355614824, 5606.495415412633, 6239.06414037898, 6302.275238347465, 6331.620102793847, 6347.460465860454, 6244.875102498016, 6251.34360892118, 6265.997440409695, 6282.026285925689, 6285.088662143872, 6185.0, 6232.940400131898, 6279.686015699288, 6323.051542268697, 6326.2092238470195, 6150.323464418821, 6157.476614487819, 6199.938000619936, 6266.122742816101, 6274.372562743689, 6171.1668924694595, 6288.654124023223, 6293.748250069946, 6306.211723534559, 6307.526935479949, 6118.710550942667, 6121.602095863755, 6125.388069147376, 6177.598456100339, 6206.565540412128], "value": 5852.808470426801, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [489.84080173943477, 497.97510124493766, 527.064460582466, 545.5035917315242, 554.0138553374994, 41588.79205603972, 43146.137077258434, 43160.35259471107, 43251.91870203247, 43329.0, 44699.55300446995, 45273.77363113188, 45314.32028519575, 45371.77314113425, 45382.773086134526, 9054.5020023899, 9561.42631442114, 9794.951025244864, 9795.902040979607, 9796.706098817047, 9089.545522723838, 11786.587469438571, 11862.228955117933, 12058.457369418396, 12068.15522913392, 11526.71183220422, 11582.942085289604, 11583.884161158365, 11602.709932251677, 11648.767024659503, 11769.705757356049, 11844.763104737944, 11853.703657408547, 11854.525818967231, 11879.049676025897, 11729.765404691858, 11840.348780817052, 11841.171118021743, 11850.288982661068, 11852.940735296355, 43086.78456607728, 43346.13307733859, 43445.34831977523, 43486.565134348566, 43613.0, 4099.528554216244, 4110.486189226347, 4112.09533902541, 4116.6912481564, 4134.607212314825, 30388.8480557598, 31771.0, 32421.351572968408, 32808.0, 33486.6651333486, 3235.498497732855, 3429.0398688367295, 3435.9656403435897, 3456.5679290088738, 3466.687998080185, 488860.0, 493784.0, 494041.0, 495786.521067396, 497288.0, 66338.0, 66536.33463665398, 66683.33316666869, 66697.6665116681, 66771.0, 68950.65524672344, 69205.0, 69282.0, 69426.65286673534, 69454.30545694579, 17138.914305428643, 17857.46427607174, 17874.0, 17880.105994700214, 17901.910490447724, 12509.437075331633, 12715.745685086247, 13627.591172264847, 13770.0, 13778.724425511433, 21339.25312614051, 21825.890870545547, 22398.32805015852, 22447.214347498088, 22479.438014049778, 8787.560621968876, 9032.683856065138, 9065.456072635663, 9069.82092327993, 9100.8634870477, 773.2615352338503, 804.7505273365275, 896.8385690575628, 907.1336873285996, 908.2688435809105, 30574.69425305763, 31713.20716982094, 31881.68118318787, 31889.840550797097, 32252.516212256836, 880.2869675562814, 1068.5084860963889, 1083.710384642273, 1119.5633702855894, 1234.9567765128177, 16330.0, 16532.669346613002, 16562.254698538596, 16698.99806011643, 16833.242504087346, 680494.0, 687537.0, 695014.5249273721, 696267.0, 700686.4965675139, 66769.33230667729, 67339.0, 67397.0, 67481.0, 67551.0, 1360.0683531780762, 1404.669902572915, 1471.71301596192, 1518.9240537973058, 1533.8312785593575, 31437.0, 33039.37448757224, 33116.83441582777, 33136.50295245621, 33889.66110338865, 47903.5209647899, 54991.17513237225, 55040.62398440071, 55141.0, 55303.89392212214, 546798.0, 546986.0, 547284.0, 548102.0, 549037.0, 38621.80689096537, 39398.0, 41719.58280417157, 45390.092198155195, 46364.30453543267, 50812.491875082254, 50840.74579627226, 51286.743566281926, 51545.7422712884, 51670.74164629153, 39367.606323936394, 40379.788606341855, 40437.79781101076, 41164.382534261415, 42766.14467710691, 39868.800655996536, 40515.0, 41622.58377416308, 41784.0, 41889.16221675611, 36752.63247367492, 37133.88598342054, 38191.236175275786, 39202.215955680156, 39526.40710389289, 31897.36205275835, 33671.494927575615, 34216.0, 34256.28718564012, 34405.96782096541, 25128.37179070538, 25167.37081572902, 25517.87241063783, 25555.616665749658, 26087.73912260853], "value": 21761.86855092828, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [333.55470446953314, 403.89094944365024, 410.21034508570995, 415.45367841288703, 439.25326944194876, 15078.924605376986, 19646.803531964677, 20321.288754893583, 20739.481512962164, 20761.480962975933, 19860.801391986075, 22404.66393004106, 22470.66294005587, 22866.856657167158, 23172.3048308551, 5003.599712023039, 6170.382961703838, 6176.752929882799, 6177.135201071854, 6180.505559555248, 4943.752812359386, 6089.665068421235, 6124.5100391968535, 6172.876542469148, 6199.287081985584, 6155.815325540241, 6160.938390616081, 6165.475934545569, 6177.135201071854, 6179.2893817210925, 5777.653340799523, 5932.644041357532, 5956.910646340287, 6152.600080994744, 6199.690015499207, 5445.210444485567, 6182.752689892399, 6189.257289125334, 6189.566730328879, 6198.2252218472695, 11409.48657310423, 13910.860891391058, 14088.295585220698, 14116.788248176286, 14129.434822607083, 2568.58902575587, 2674.6121812337296, 2679.9866000670067, 2726.209399274208, 2733.5762956741737, 9986.300958932878, 10875.238733288674, 11163.0, 11408.71478213043, 16809.41167059147, 1685.4690772406775, 1865.9923641233718, 1866.2814816295825, 1879.5676994291252, 1895.4787433455772, 135291.0, 136881.0, 144661.0, 146121.0, 147306.0, 10411.802642696186, 11997.580084696994, 12181.756364872654, 12221.816672749916, 12273.57042503526, 15922.96500727449, 16147.0, 16175.43385981485, 16322.510324690278, 16324.591885202964, 9084.8637270441, 9133.588988495534, 9185.311101667401, 9212.0, 9274.258059355236, 7371.88942165868, 8971.013188549254, 8984.595693193822, 9139.086091390807, 9162.541872906328, 4885.291632713237, 4891.6575839691595, 4901.852944411673, 4916.311716359713, 4970.502949705001, 2009.7186393904865, 2056.4653190170366, 2058.711780350752, 2059.3718915730547, 2062.102985201442, 880.5641207602278, 912.4707669551644, 918.8851393575803, 930.7393929699695, 948.796008858085, 21301.786982130292, 22449.438764030703, 22506.774932250795, 22571.88714056419, 22613.88693056524, 770.6841686555246, 801.9558924259222, 925.2135684668112, 955.8852937647526, 962.8892677342195, 10742.570297188026, 11464.94267528657, 11502.0, 11516.596919107791, 11528.942355288169, 717832.0, 730412.0, 748654.0, 765260.0, 765723.0, 123967.0, 128273.0, 148808.0, 151420.0, 154175.0, 1045.4093437207953, 1047.6333283350766, 1069.059227879461, 1069.9786004280027, 1072.0565902006185, 18481.0, 19373.83756974586, 19495.317663881695, 19506.80493195107, 19665.0, 49764.75117624389, 57844.71077644585, 57954.0, 58404.0, 59454.0, 75960.62019689866, 79347.60326198333, 82074.0, 82837.57173538774, 82971.0960116393, 8388.958055209685, 8498.70254541088, 8567.785805354915, 8958.283337333129, 9086.45481271126, 12711.682207944876, 13301.933490332873, 13563.525276615272, 14235.0, 14262.500812471513, 11077.501512431798, 11570.884291157317, 11772.999295060015, 11872.347020913932, 12002.939985300018, 11057.889421106007, 11380.94309528447, 11807.17349785541, 11857.822132667845, 11955.581554645894, 11446.255993360404, 11717.179797414099, 11728.179027467995, 12101.69745756363, 12141.150119491904, 8046.195380462141, 8400.41197116196, 8600.483970961763, 8767.991680956771, 8768.605412756313, 11705.531778728755, 11853.585124520945, 11926.642200733992, 12037.699057523632, 12082.516699331929], "value": 9978.823085510596, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1376.669599296168, 1442.3365251984087, 1447.8769304609107, 1463.136749317903, 1492.2315007770999, 7564.621768911553, 8227.38294627903, 8474.067852536216, 8478.57607119643, 8519.488830670163, 8303.709370172046, 8375.0, 8380.664773409071, 8383.161683831613, 8384.706535271267, 2123.373604786592, 2354.058376649341, 2393.652920326552, 2397.7841994220516, 2402.8318017738766, 2204.7574766775642, 2320.8955596998176, 2426.599611064172, 2427.7936375408112, 2433.5011322678806, 2341.8711970841596, 2379.298107058422, 2383.2254517281867, 2389.7610238976135, 2393.9880300598475, 2372.28831350595, 2405.2423486601665, 2405.2663937499055, 2406.9518609627885, 2409.8795060246916, 2385.9284221473386, 2402.783749462557, 2432.1001229545004, 2437.4881274932286, 2441.3042282949273, 8433.367497437655, 8502.914970850274, 8507.702230421906, 8508.106648801848, 8515.829683406297, 5176.689398636094, 5328.760205790749, 5330.813421530228, 5338.546223571001, 5353.866153346197, 3401.914952126192, 3595.694365978895, 3607.116256517144, 3647.963520364789, 3659.249853779995, 1084.219362059316, 1234.7407044520662, 1272.6118533847173, 1334.893208543324, 1335.2522587351114, 10715.732106697316, 10834.40410777407, 10944.23390362675, 10963.232573719843, 10981.780364392747, 4522.140793249272, 4708.529147085264, 4745.430548334222, 4804.735739534359, 4821.951780482221, 9645.758856028655, 9650.93839677635, 9661.275404344702, 9667.129958303645, 9671.274654400808, 5373.865653358697, 5375.113106337489, 5382.623216374895, 5383.138697808332, 5386.461353864661, 4484.686071974996, 4793.400824896888, 4844.975775121173, 4880.682755620874, 4938.160512712848, 3346.263821959165, 3798.4682144499793, 4037.5760545142925, 4104.651104656137, 4115.629593336614, 1307.0, 1307.457405176841, 1307.5554311534124, 1318.5846458365584, 1319.4458327502473, 795.8249185179251, 907.6460180529599, 908.8046070094962, 932.8647346134908, 943.3396622364372, 5582.720863956786, 5621.915671264935, 5740.885182296331, 5771.59598828078, 5791.218185544897, 1007.6674697350004, 1030.386919782728, 1042.6393556408807, 1054.446415631784, 1056.894310568937, 3646.4165733482514, 3812.5996770338716, 3821.178446633987, 3892.202098569843, 3967.7420967637013, 9786.461744604116, 10008.249381296431, 10017.749556261151, 10039.899601004043, 10042.949785251172, 9596.520173991272, 9936.354136981074, 9939.50302484873, 9945.403275803475, 9962.800743985079, 7793.142754297023, 7981.640826162837, 7983.2415920487465, 7986.920130798734, 7992.960035199903, 5712.571557133148, 5768.596198266249, 5783.450572195635, 5797.2173756542325, 6014.879702406015, 7600.657970391235, 9356.298277629341, 9368.578413971523, 9380.906190938003, 9385.592161175879, 9122.908770912207, 9473.52632368365, 9484.05159484046, 9492.905070949479, 9506.857397139187, 5682.829515114553, 6834.897476537955, 6968.930310696828, 6974.023636690766, 6979.895301570582, 7515.023047003854, 7583.203763604742, 7640.579768112585, 7644.15914249421, 7649.847003060019, 6840.760573379908, 7188.353048225685, 7195.172555156224, 7206.675699593426, 7300.23347548521, 7061.470389720895, 7087.397571206505, 7102.431805455654, 7149.857002860018, 7152.320529549685, 5487.725613719218, 6384.553081284451, 6442.806715798533, 6530.183727034121, 6534.934650653623, 4544.7500387479, 4586.357909892685, 4607.953920460753, 4614.884627884329, 4748.620110391092, 5023.09584274834, 5056.974715126548, 5078.619103567174, 5155.793768249228, 5240.34495688039], "value": 4489.860914317359, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [369.1454283334081, 372.5380528145099, 380.8114983083373, 381.3003139239497, 384.23728898137176, 5177.55990740787, 5263.5261427129235, 5313.57491400688, 5338.519533242007, 5345.151490926536, 4111.848682368934, 5022.522860328272, 5156.407013193484, 5202.505761952609, 5220.243064755608, 3711.42472916697, 3808.6191380861833, 4051.7771522566172, 4110.0, 4179.519355274137, 3646.8665830489194, 3650.671439570438, 3829.6936245100464, 4031.951692559941, 4175.728577642459, 3500.6149323574386, 3647.2340808430263, 4176.582341765829, 4184.363850774008, 4211.5788421157795, 3559.57285125784, 3572.998241968998, 4129.91740165198, 4141.627253547165, 4191.580841915799, 3228.4350238708366, 3314.6188188358406, 3592.2276710507367, 3688.2254726507467, 3736.23407201523, 4372.846950356754, 4886.560209581119, 5063.139266324733, 5142.871428214287, 5189.195674670432, 3529.000349702758, 4504.1892459357305, 4615.930761038587, 4819.638527110481, 4831.323614693945, 4794.113089078532, 5202.895942081175, 5227.26818245446, 5473.698946557938, 5620.9437905621235, 3308.718758905496, 3933.328335457419, 3941.921161576752, 3970.463987361698, 3971.0, 4290.156881836887, 5454.209139674725, 5538.446155384429, 5917.260342457193, 5917.822465326047, 3799.35410980134, 3865.9226815463535, 3956.208758248362, 3970.0273433009097, 3984.6812255019527, 3544.61009288978, 3795.7853486884483, 3808.924136345698, 3987.5414327352146, 4019.959800402017, 4084.630914069832, 4342.457192850894, 4477.462704475483, 4560.498345182027, 4682.601978831837, 5576.553875689935, 5580.19087232349, 5600.299962504687, 5611.80358687444, 5623.943760562423, 1282.2883299768719, 1292.9094963352475, 1295.0, 1297.5782870567105, 1301.5444594391888, 806.3106044332012, 827.6772058897035, 831.5218749219102, 881.5592203898051, 890.799570096736, 4604.447466304065, 4820.493848145964, 4829.913269514402, 4860.930595269035, 4966.491921579579, 4844.442889067732, 4908.282101264529, 4911.9754401227765, 5436.70098144598, 5464.453554644504, 4378.211921854033, 4666.906661866744, 4714.363560919301, 4807.78364973577, 4808.663393562487, 2849.891080600341, 2854.414844956779, 2874.726900944407, 2887.797854150231, 2915.329474220941, 4850.7817148227705, 5451.155070964007, 5535.944640553543, 5548.805791797348, 5605.7197140142825, 4567.200739870509, 4783.823360371023, 5023.748812559357, 5213.7914483421, 5594.0769772987815, 5503.697296648723, 5579.553635709133, 5625.324961004624, 5646.543753467255, 5659.293162978256, 4597.563231493003, 4720.480747117883, 4756.6908150970075, 5185.714785686672, 5385.8922821542565, 4591.908161836812, 5094.745262736922, 5363.973180134074, 5414.3232095988005, 5481.780728770964, 4715.764211789466, 5348.806989134436, 5661.499108208902, 5708.343540492897, 5804.1874137619925, 3384.967584886633, 3614.4578313253223, 3859.26673931952, 3975.6819454443, 3983.6813054956115, 5807.245058142415, 5826.73779679907, 5828.533717302521, 5842.561807864342, 5854.121881717776, 4486.945567791631, 5265.657732247391, 5471.72641367922, 5530.336359636708, 5631.8592035199445, 4966.428860681068, 5061.785766038518, 5088.0, 5618.69097199658, 5663.32040155184, 4896.143174944442, 5237.900040991434, 5498.367687715964, 5517.724113794214, 5526.41972592888, 4665.034720487559, 5219.660722053054, 5547.973624879411, 5566.471185237396, 5602.439756024365, 4763.903462749102, 5192.45479224676, 5215.973920130375, 5483.341998960151, 5509.393966663583], "value": 4009.9355923414787, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [676.5162908520407, 687.2062767503533, 753.6043577122007, 768.19339693322, 786.476992799788, 15063.849361506382, 15160.317785699628, 15610.609734756637, 15644.296006679699, 15784.842151578481, 14287.499937502189, 14472.855271447283, 14615.123092614424, 14727.558173254793, 14754.483593074245, 903.4714691905227, 924.4869097650801, 925.0934084597098, 926.1294383279695, 931.6320053578833, 732.8241222106683, 756.4477931110292, 899.2176806178601, 910.6129894794719, 920.5673333533229, 968.8498282766147, 969.92725545584, 977.1108291454777, 977.569869257528, 982.6462473509531, 971.6016433262364, 973.245734555718, 973.5570315506427, 973.9805203895883, 976.4531862157179, 724.6775185042658, 725.2928394815013, 728.0353531570637, 728.7631519756047, 730.9853802923911, 15005.174715390649, 15146.0, 15151.696966060617, 15281.694366112726, 15882.602934926605, 14544.709105817825, 14715.779263311058, 14717.190554519497, 14739.410423583044, 14798.112113273239, 11425.942870285595, 11640.708982275426, 11656.592019279284, 11827.94086029573, 11874.346910919896, 3717.5910649828497, 3872.9419058714143, 3879.534455865286, 3902.0, 3935.094928166509, 107873.0, 111206.88793112047, 112441.75116497625, 112906.43546782213, 112973.0, 11145.2198346115, 11189.160812938899, 11316.745765404476, 11624.011958983412, 11624.767504650028, 17879.195436205402, 20103.798962010194, 23203.071877124727, 23453.530929381315, 23620.645690314657, 6976.965115174392, 7854.764357069297, 7904.486208396436, 8069.386122775469, 8315.293200078062, 4367.737935723867, 4391.407160033418, 4505.977470112629, 4577.931331030038, 4608.608268297232, 3562.1450851795385, 3584.766990145632, 3613.367660659374, 3617.077645200457, 3641.1443310821937, 683.9145106861642, 687.2131409536054, 692.6190595172635, 699.8110510162228, 701.2496628607341, 662.2648859765657, 665.262114264469, 669.2537820330297, 694.2224708326706, 696.2445746365149, 9856.016626532532, 10303.896961030443, 10326.733365983402, 10544.578216871392, 10706.089982351432, 648.4747354642755, 654.195851125712, 696.2584847137782, 696.627304392158, 708.787363790871, 4948.975255123702, 5019.698818070928, 5035.244713292962, 5035.269885866529, 5041.395032596112, 94257.0, 102411.97588024025, 109942.45028774806, 112515.43742281236, 112551.31173032412, 70541.6472917632, 71085.64457177681, 72008.91986620205, 78237.82643260356, 96343.55484667736, 54022.45977540253, 61575.384246158756, 63870.0, 67846.66076669584, 69734.65132674406, 10956.56173753041, 10978.615748448767, 11025.724356891142, 11349.943250284026, 11418.543258269576, 31220.0, 43411.78294108509, 43803.56196437995, 45051.549484506046, 45331.54668453273, 54405.45594544004, 57028.71485642545, 58789.41210587839, 60870.69564652148, 65089.0, 13658.0, 13695.931520342334, 13744.381502832597, 13807.378667959765, 13934.30328483592, 15226.0, 15321.923390382977, 15336.233188340762, 15567.299471523582, 15918.7612185815, 13871.653208669864, 14269.857301426853, 14650.853491464948, 14661.04703194289, 14801.777973330623, 12234.021278297892, 13692.726145477234, 14027.649308766955, 14482.855171448151, 14975.475858344906, 13776.448942042207, 14016.369263382969, 14263.857361426253, 14267.42930282777, 14763.261836908327, 10775.191860610643, 10909.236353455499, 11042.558297668003, 11046.502907369028, 11441.14191435629, 8714.389992700704, 9268.0, 11524.82712759326, 11546.480408381474, 11934.761304774029], "value": 7610.941535418925, "unit": "score"}], "name": "dromaeo_css", "value": 7473.085090060088, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 115.0, 114.0, 115.0, 114.0, 115.0, 114.0, 112.0, 113.0, 116.0], "value": 113.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 108.0, 109.0, 145.0, 109.0, 110.0, 109.0, 108.0, 128.0, 107.0], "value": 117.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [184.0, 184.0, 184.0, 183.0, 185.0, 184.0, 184.0, 183.0, 184.0, 184.0], "value": 183.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 58.0, 58.0, 89.0, 58.0, 81.0, 49.0, 78.0, 86.0, 79.0], "value": 71.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 69.0, 85.0, 69.0, 67.0, 68.0, 81.0, 67.0, 68.0, 81.0], "value": 73.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 85.0, 89.0, 85.0, 87.0, 84.0, 89.0, 86.0, 88.0, 85.0], "value": 86.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 92.0, 93.0, 93.0, 93.0, 93.0, 101.0, 146.0, 92.0, 93.0], "value": 98.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 88.0, 87.0, 84.0, 86.0, 87.0, 86.0, 86.0, 84.0, 85.0], "value": 85.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 50.0, 51.0, 53.0, 54.0, 55.0, 55.0, 55.0, 56.0, 55.0], "value": 54.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 64.0, 78.0, 75.0, 70.0, 71.0, 67.0, 68.0, 65.0, 91.0], "value": 71.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 85.0, 82.0, 82.0, 81.0, 80.0, 80.0, 88.0, 86.0], "value": 83.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 131.0, 133.0, 143.0, 129.0, 138.0, 132.0, 147.0, 182.0, 143.0], "value": 141.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 162.0, 161.0, 163.0, 161.0, 168.0, 216.0, 192.0, 162.0], "value": 171.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 65.0, 64.0, 64.0, 64.0, 63.0, 64.0, 63.0, 63.0, 63.0], "value": 63.7, "unit": "score"}], "name": "kraken", "value": 1416.1, "alertThreshold": 2.0}]} 13:30:20 INFO - Return code: 0 13:30:20 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:30:20 INFO - # TBPL SUCCESS # 13:30:20 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 13:30:20 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 13:30:20 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 13:30:20 INFO - 2017-03-08 13:30:20.448 screenresolution[1922:13082] starting screenresolution argv=screenresolution get 13:30:20 INFO - 2017-03-08 13:30:20.451 screenresolution[1922:13082] Display 0: 1600x1200x32@60 13:30:20 INFO - 2017-03-08 13:30:20.457 screenresolution[1923:13085] starting screenresolution argv=screenresolution list 13:30:20 INFO - Available Modes on Display 0 13:30:20 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 13:30:20 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 13:30:20 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 13:30:20 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 13:30:20 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 13:30:20 INFO - Intel Iris: 13:30:20 INFO - Chipset Model: Intel Iris 13:30:20 INFO - Type: GPU 13:30:20 INFO - Bus: Built-In 13:30:20 INFO - VRAM (Dynamic, Max): 1536 MB 13:30:20 INFO - Vendor: Intel (0x8086) 13:30:20 INFO - Device ID: 0x0a2e 13:30:20 INFO - Revision ID: 0x0009 13:30:20 INFO - Displays: 13:30:20 INFO - Display: 13:30:20 INFO - Resolution: 1600 x 1200 @ 60 Hz 13:30:20 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 13:30:20 INFO - Display Serial Number: 1600x1200 60 13:30:20 INFO - Main Display: Yes 13:30:20 INFO - Mirror: Off 13:30:20 INFO - Online: Yes 13:30:20 INFO - Rotation: Supported 13:30:20 INFO - Return code: 0 13:30:20 INFO - Running post-action listener: _resource_record_post_action 13:30:20 INFO - [mozharness: 2017-03-08 21:30:20.691739Z] Finished run-tests step (success) 13:30:20 INFO - Running post-run listener: _resource_record_post_run 13:30:20 INFO - Total resource usage - Wall time: 1190s; CPU: 54.0%; Read bytes: 2813952; Write bytes: 419885568; Read time: 18; Write time: 1563 13:30:20 INFO - TinderboxPrint: CPU usage
53.7% 13:30:20 INFO - TinderboxPrint: I/O read bytes / time
2,813,952 / 18 13:30:20 INFO - TinderboxPrint: I/O write bytes / time
419,885,568 / 1,563 13:30:20 INFO - TinderboxPrint: CPU idle
2,205.6 (46.3%) 13:30:20 INFO - TinderboxPrint: CPU system
947.5 (19.9%) 13:30:20 INFO - TinderboxPrint: CPU user
1,608.5 (33.8%) 13:30:20 INFO - TinderboxPrint: Swap in / out
124,911,616 / 0 13:30:20 INFO - install - Wall time: 15s; CPU: 53.0%; Read bytes: 111768064; Write bytes: 105600512; Read time: 10024; Write time: 226 13:30:20 INFO - run-tests - Wall time: 1176s; CPU: 54.0%; Read bytes: 2813952; Write bytes: 295906304; Read time: 18; Write time: 1286 13:30:21 INFO - Running post-run listener: _upload_blobber_files 13:30:21 INFO - Blob upload gear active. 13:30:21 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:30:21 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 13:30:21 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-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 13:30:21 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-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 13:30:21 INFO - (blobuploader) - INFO - Open directory for files ... 13:30:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 13:30:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:30:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:30:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 13:30:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:30:22 INFO - (blobuploader) - INFO - Done attempting. 13:30:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 13:30:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:30:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:30:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 13:30:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:30:23 INFO - (blobuploader) - INFO - Done attempting. 13:30:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 13:30:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:30:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:30:24 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 13:30:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:30:24 INFO - (blobuploader) - INFO - Done attempting. 13:30:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:30:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:30:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:30:26 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:30:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:30:26 INFO - (blobuploader) - INFO - Done attempting. 13:30:26 INFO - (blobuploader) - INFO - Iteration through files over. 13:30:26 INFO - Return code: 0 13:30:26 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:30:26 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:30:26 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/57a5a81ec768352b10e841c25ddf1a724078a7fa18e1954a3b8f2d32bf59bd9ada0da11908a232fb32e1fb5e5e08ccc0b9eb44036a604d8912f36b5f6d9b0577", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0cbb2c4a8d67f298801b5bd6b35afe869c12bbdc5a83771cfba73882cd473e554aa5ebab93fb90543b9b71ea628eed18001d4c447123b3e5af828a1ee8a3ddd7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/32aa68c4dd134b4e6370dc140dce5e6195692802197d6508991c165f13c9583267bcde89574367f1d82aa948dfc84bd7810426bc71d862e2a53a90cc19a86bd1", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/8546669f94ff08f2557a75051e7ef50218b4bc4826fd16b71a1d4e6b775b5b14197e0d47022bd4a599138149aff13f09dbfd289fe3fe340b790c8df3f25add72"} 13:30:26 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:30:26 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:30:26 INFO - Contents: 13:30:26 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/57a5a81ec768352b10e841c25ddf1a724078a7fa18e1954a3b8f2d32bf59bd9ada0da11908a232fb32e1fb5e5e08ccc0b9eb44036a604d8912f36b5f6d9b0577", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0cbb2c4a8d67f298801b5bd6b35afe869c12bbdc5a83771cfba73882cd473e554aa5ebab93fb90543b9b71ea628eed18001d4c447123b3e5af828a1ee8a3ddd7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/32aa68c4dd134b4e6370dc140dce5e6195692802197d6508991c165f13c9583267bcde89574367f1d82aa948dfc84bd7810426bc71d862e2a53a90cc19a86bd1", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/8546669f94ff08f2557a75051e7ef50218b4bc4826fd16b71a1d4e6b775b5b14197e0d47022bd4a599138149aff13f09dbfd289fe3fe340b790c8df3f25add72"} 13:30:26 INFO - Running post-run listener: copy_logs_to_upload_dir 13:30:26 INFO - Copying logs to upload dir... 13:30:26 INFO - mkdir: /builds/slave/test/build/upload/logs 13:30:26 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1249.882876 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2017-03-08 13:30:27.015826) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-08 13:30:27.019225) ========= 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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners TMPDIR=/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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-Beta/sha512/57a5a81ec768352b10e841c25ddf1a724078a7fa18e1954a3b8f2d32bf59bd9ada0da11908a232fb32e1fb5e5e08ccc0b9eb44036a604d8912f36b5f6d9b0577", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0cbb2c4a8d67f298801b5bd6b35afe869c12bbdc5a83771cfba73882cd473e554aa5ebab93fb90543b9b71ea628eed18001d4c447123b3e5af828a1ee8a3ddd7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/32aa68c4dd134b4e6370dc140dce5e6195692802197d6508991c165f13c9583267bcde89574367f1d82aa948dfc84bd7810426bc71d862e2a53a90cc19a86bd1", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/8546669f94ff08f2557a75051e7ef50218b4bc4826fd16b71a1d4e6b775b5b14197e0d47022bd4a599138149aff13f09dbfd289fe3fe340b790c8df3f25add72"} build_url:https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011032 build_url: 'https://queue.taskcluster.net/v1/task/EYm74PMIT7Silq_OFf2UTQ/artifacts/public/build/firefox-53.0.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/57a5a81ec768352b10e841c25ddf1a724078a7fa18e1954a3b8f2d32bf59bd9ada0da11908a232fb32e1fb5e5e08ccc0b9eb44036a604d8912f36b5f6d9b0577", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0cbb2c4a8d67f298801b5bd6b35afe869c12bbdc5a83771cfba73882cd473e554aa5ebab93fb90543b9b71ea628eed18001d4c447123b3e5af828a1ee8a3ddd7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/32aa68c4dd134b4e6370dc140dce5e6195692802197d6508991c165f13c9583267bcde89574367f1d82aa948dfc84bd7810426bc71d862e2a53a90cc19a86bd1", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/8546669f94ff08f2557a75051e7ef50218b4bc4826fd16b71a1d4e6b775b5b14197e0d47022bd4a599138149aff13f09dbfd289fe3fe340b790c8df3f25add72"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-08 13:30:27.053968) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-08 13:30:27.054296) ========= 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.eGCLYfFpqp/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.u9vwbxEeCy/Listeners TMPDIR=/var/folders/gh/t76btwz501jcblhsxv28_zf400000w/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.005164 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-08 13:30:27.104448) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-08 13:30:27.104765) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-08 13:30:27.105133) ========= ========= Total master_lag: 0.18 =========