builder: mozilla-aurora_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0131 starttime: 1488023417.41 results: success (0) buildid: 20170225020729 builduid: 1cc7359de2bd448aa7dcbd0161ded186 revision: 329442feed2426f939cce4c4126a837573ff11da ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:17.412824) ========= master: http://buildbot-master132.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:17.413267) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:17.413554) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:17.441058) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:17.441447) ========= 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.6ssLNwRHAC/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.w2R71mCuVc/Listeners TMPDIR=/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/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-02-25 03:50:17-- 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% 23.8M=0s 2017-02-25 03:50:17 (23.8 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.167688 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:17.635256) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:17.635605) ========= 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.6ssLNwRHAC/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.w2R71mCuVc/Listeners TMPDIR=/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/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.033913 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:17.691744) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2017-02-25 03:50:17.692206) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 329442feed2426f939cce4c4126a837573ff11da --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 329442feed2426f939cce4c4126a837573ff11da --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.6ssLNwRHAC/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.w2R71mCuVc/Listeners TMPDIR=/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/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-02-25 03:50:17,759 truncating revision to first 12 chars 2017-02-25 03:50:17,759 Setting DEBUG logging. 2017-02-25 03:50:17,760 attempt 1/10 2017-02-25 03:50:17,760 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/329442feed24?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-25 03:50:19,503 unpacking tar archive at: mozilla-aurora-329442feed24/testing/mozharness/ program finished with exit code 0 elapsedTime=2.015335 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2017-02-25 03:50:19.732304) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:19.733454) ========= script_repo_revision: 329442feed2426f939cce4c4126a837573ff11da ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:19.733859) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:19.734123) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-25 03:50:19.755967) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2017-02-25 03:50:19.756364) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.6ssLNwRHAC/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.w2R71mCuVc/Listeners TMPDIR=/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 03:50:19 INFO - MultiFileLogger online at 20170225 03:50:19 in /builds/slave/test 03:50:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 03:50:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:50:19 INFO - {'append_to_log': False, 03:50:19 INFO - 'base_work_dir': '/builds/slave/test', 03:50:19 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 03:50:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:50:19 INFO - 'branch': 'Mozilla-Aurora', 03:50:19 INFO - 'buildbot_json_path': 'buildprops.json', 03:50:19 INFO - 'config_files': ('talos/mac_config.py',), 03:50:19 INFO - 'default_actions': ('clobber', 03:50:19 INFO - 'read-buildbot-config', 03:50:19 INFO - 'download-and-extract', 03:50:19 INFO - 'populate-webroot', 03:50:19 INFO - 'create-virtualenv', 03:50:19 INFO - 'install', 03:50:19 INFO - 'run-tests'), 03:50:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:50:19 INFO - 'download_minidump_stackwalk': True, 03:50:19 INFO - 'download_symbols': 'ondemand', 03:50:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:50:19 INFO - 'tooltool.py': '/tools/tooltool.py', 03:50:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:50:19 INFO - '/tools/misc-python/virtualenv.py')}, 03:50:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:50:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:50:19 INFO - 'installer_path': 'installer.exe', 03:50:19 INFO - 'log_level': 'info', 03:50:19 INFO - 'log_name': 'talos', 03:50:19 INFO - 'log_to_console': True, 03:50:19 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 03:50:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 03:50:19 INFO - 'opt_config_files': (), 03:50:19 INFO - 'pip_index': False, 03:50:19 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 03:50:19 INFO - 'cmd': ('bash', 03:50:19 INFO - '-c', 03:50:19 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 03:50:19 INFO - 'enabled': True, 03:50:19 INFO - 'halt_on_failure': False, 03:50:19 INFO - 'name': 'check_screen_resolution'},), 03:50:19 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 03:50:19 INFO - 'cmd': ('bash', 03:50:19 INFO - '-c', 03:50:19 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 03:50:19 INFO - 'enabled': True, 03:50:19 INFO - 'halt_on_failure': False, 03:50:19 INFO - 'name': 'check_screen_resolution'},), 03:50:19 INFO - 'run_cmd_checks_enabled': True, 03:50:19 INFO - 'sps_profile': False, 03:50:19 INFO - 'sps_profile_interval': 0, 03:50:19 INFO - 'suite': 'dromaeojs', 03:50:19 INFO - 'system_bits': '32', 03:50:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:50:19 INFO - 'title': 't-yosemite-r7-0131', 03:50:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:50:19 INFO - 'use_talos_json': True, 03:50:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:50:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:50:19 INFO - 'work_dir': 'build'} 03:50:19 INFO - [mozharness: 2017-02-25 11:50:19.934405Z] Running clobber step. 03:50:19 INFO - Running pre-action listener: _resource_record_pre_action 03:50:19 INFO - Running main action method: clobber 03:50:19 INFO - rmtree: /builds/slave/test/build 03:50:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:50:22 INFO - Running post-action listener: _resource_record_post_action 03:50:22 INFO - [mozharness: 2017-02-25 11:50:22.435912Z] Finished clobber step (success) 03:50:22 INFO - [mozharness: 2017-02-25 11:50:22.436041Z] Running read-buildbot-config step. 03:50:22 INFO - Running pre-action listener: _resource_record_pre_action 03:50:22 INFO - Running main action method: read_buildbot_config 03:50:22 INFO - Using buildbot properties: 03:50:22 INFO - { 03:50:22 INFO - "project": "", 03:50:22 INFO - "product": "firefox", 03:50:22 INFO - "script_repo_revision": "production", 03:50:22 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs", 03:50:22 INFO - "repository": "", 03:50:22 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs", 03:50:22 INFO - "buildid": "20170225020729", 03:50:22 INFO - "stage_platform": "macosx64", 03:50:22 INFO - "basedir": "/builds/slave/test", 03:50:22 INFO - "nightly_build": "True", 03:50:22 INFO - "buildnumber": 56, 03:50:22 INFO - "slavename": "t-yosemite-r7-0131", 03:50:22 INFO - "master": "http://buildbot-master132.bb.releng.scl3.mozilla.com:8201/", 03:50:22 INFO - "platform": "yosemite_r7", 03:50:22 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 03:50:22 INFO - "branch": "mozilla-aurora", 03:50:22 INFO - "repo_path": "releases/mozilla-aurora", 03:50:22 INFO - "revision": "329442feed2426f939cce4c4126a837573ff11da", 03:50:22 INFO - "pgo_build": "False", 03:50:22 INFO - "builduid": "1cc7359de2bd448aa7dcbd0161ded186", 03:50:22 INFO - "slavebuilddir": "test" 03:50:22 INFO - } 03:50:22 INFO - Found installer url https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg. 03:50:22 INFO - Running post-action listener: _resource_record_post_action 03:50:22 INFO - [mozharness: 2017-02-25 11:50:22.439495Z] Finished read-buildbot-config step (success) 03:50:22 INFO - [mozharness: 2017-02-25 11:50:22.439625Z] Running download-and-extract step. 03:50:22 INFO - Running pre-action listener: _resource_record_pre_action 03:50:22 INFO - Running main action method: download_and_extract 03:50:22 INFO - mkdir: /builds/slave/test/build/tests 03:50:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:22 INFO - trying https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.test_packages.json 03:50:22 INFO - Downloading https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-53.0a2.en-US.mac.test_packages.json 03:50:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-53.0a2.en-US.mac.test_packages.json'}, attempt #1 03:50:23 INFO - Downloaded 1199 bytes. 03:50:23 INFO - Reading from file /builds/slave/test/build/firefox-53.0a2.en-US.mac.test_packages.json 03:50:23 INFO - Using the following test package requirements: 03:50:23 INFO - {u'common': [u'firefox-53.0a2.en-US.mac.common.tests.zip'], 03:50:23 INFO - u'cppunittest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 03:50:23 INFO - u'firefox-53.0a2.en-US.mac.cppunittest.tests.zip'], 03:50:23 INFO - u'gtest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 03:50:23 INFO - u'firefox-53.0a2.en-US.mac.gtest.tests.zip'], 03:50:23 INFO - u'jittest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 03:50:23 INFO - u'jsshell-mac.zip'], 03:50:23 INFO - u'mochitest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 03:50:23 INFO - u'firefox-53.0a2.en-US.mac.mochitest.tests.zip'], 03:50:23 INFO - u'mozbase': [u'firefox-53.0a2.en-US.mac.common.tests.zip'], 03:50:23 INFO - u'reftest': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 03:50:23 INFO - u'firefox-53.0a2.en-US.mac.reftest.tests.zip'], 03:50:23 INFO - u'talos': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 03:50:23 INFO - u'firefox-53.0a2.en-US.mac.talos.tests.zip'], 03:50:23 INFO - u'web-platform': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 03:50:23 INFO - u'firefox-53.0a2.en-US.mac.web-platform.tests.zip'], 03:50:23 INFO - u'xpcshell': [u'firefox-53.0a2.en-US.mac.common.tests.zip', 03:50:23 INFO - u'firefox-53.0a2.en-US.mac.xpcshell.tests.zip']} 03:50:23 INFO - Downloading packages: [u'firefox-53.0a2.en-US.mac.common.tests.zip'] for test suite category: common 03:50:23 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip 03:50:23 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip'}, attempt #1 03:50:23 INFO - Fetch https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip into memory 03:50:24 INFO - Expected file size: 16357900 03:50:24 INFO - Obtained file size: 16357900 03:50:31 INFO - Downloading packages: [u'firefox-53.0a2.en-US.mac.common.tests.zip', u'firefox-53.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 03:50:31 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip 03:50:31 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip'}, attempt #1 03:50:31 INFO - Fetch https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.common.tests.zip into memory 03:50:32 INFO - Expected file size: 16357900 03:50:32 INFO - Obtained file size: 16357900 03:50:38 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.talos.tests.zip 03:50:38 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.talos.tests.zip'}, attempt #1 03:50:38 INFO - Fetch https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.talos.tests.zip into memory 03:50:40 INFO - Expected file size: 14403472 03:50:40 INFO - Obtained file size: 14403472 03:50:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:40 INFO - trying https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg 03:50:40 INFO - Downloading https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-53.0a2.en-US.mac.dmg 03:50:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-53.0a2.en-US.mac.dmg'}, attempt #1 03:50:42 INFO - Downloaded 74041481 bytes. 03:50:42 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg 03:50:42 INFO - mkdir: /builds/slave/test/properties 03:50:42 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:50:42 INFO - Writing to file /builds/slave/test/properties/build_url 03:50:42 INFO - Contents: 03:50:42 INFO - build_url:https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg 03:50:43 INFO - Running post-action listener: _resource_record_post_action 03:50:43 INFO - Running post-action listener: set_extra_try_arguments 03:50:43 INFO - [mozharness: 2017-02-25 11:50:43.262405Z] Finished download-and-extract step (success) 03:50:43 INFO - [mozharness: 2017-02-25 11:50:43.262557Z] Running populate-webroot step. 03:50:43 INFO - Running pre-action listener: _resource_record_pre_action 03:50:43 INFO - Running main action method: populate_webroot 03:50:43 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:50:43 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:50:43 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:50:43 INFO - '--tppagecycles', 03:50:43 INFO - '7'], 03:50:43 INFO - 'tests': ['tsvgm']}}, 03:50:43 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:50:43 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:50:43 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:50:43 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:50:43 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 03:50:43 INFO - 'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:50:43 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 03:50:43 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:50:43 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 03:50:43 INFO - 'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['damp', 'tps']}, 03:50:43 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 03:50:43 INFO - 'tests': ['damp', 'tps']}, 03:50:43 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['dromaeo_dom']}, 03:50:43 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:50:43 INFO - 'g4': {'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['basic_compositor_video']}, 03:50:43 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 03:50:43 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['a11yr', 03:50:43 INFO - 'ts_paint', 03:50:43 INFO - 'tpaint', 03:50:43 INFO - 'sessionrestore', 03:50:43 INFO - 'sessionrestore_no_auto_restore', 03:50:43 INFO - 'tabpaint']}, 03:50:43 INFO - 'other-e10s': {'tests': ['a11yr', 03:50:43 INFO - 'ts_paint', 03:50:43 INFO - 'tpaint', 03:50:43 INFO - 'sessionrestore', 03:50:43 INFO - 'sessionrestore_no_auto_restore', 03:50:43 INFO - 'tabpaint']}, 03:50:43 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:50:43 INFO - 'ts_paint', 03:50:43 INFO - 'tpaint', 03:50:43 INFO - 'sessionrestore', 03:50:43 INFO - 'sessionrestore_no_auto_restore', 03:50:43 INFO - 'tabpaint']}, 03:50:43 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:50:43 INFO - 'ts_paint', 03:50:43 INFO - 'tpaint', 03:50:43 INFO - 'sessionrestore', 03:50:43 INFO - 'sessionrestore_no_auto_restore', 03:50:43 INFO - 'tabpaint']}, 03:50:43 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['a11yr', 03:50:43 INFO - 'ts_paint', 03:50:43 INFO - 'tpaint', 03:50:43 INFO - 'sessionrestore', 03:50:43 INFO - 'sessionrestore_no_auto_restore', 03:50:43 INFO - 'tabpaint']}, 03:50:43 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['a11yr', 03:50:43 INFO - 'ts_paint', 03:50:43 INFO - 'tpaint', 03:50:43 INFO - 'sessionrestore', 03:50:43 INFO - 'sessionrestore_no_auto_restore', 03:50:43 INFO - 'tabpaint']}, 03:50:43 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['tsvgx', 03:50:43 INFO - 'tsvgr_opacity', 03:50:43 INFO - 'tart', 03:50:43 INFO - 'tscrollx', 03:50:43 INFO - 'cart', 03:50:43 INFO - 'tsvg_static']}, 03:50:43 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:50:43 INFO - 'tsvgr_opacity', 03:50:43 INFO - 'tart', 03:50:43 INFO - 'tscrollx', 03:50:43 INFO - 'cart', 03:50:43 INFO - 'tsvg_static']}, 03:50:43 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 03:50:43 INFO - 'talos_options': ['--disable-e10s'], 03:50:43 INFO - 'tests': ['tp5o']}, 03:50:43 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 03:50:43 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 03:50:43 INFO - 'talos_options': ['--disable-e10s', 03:50:43 INFO - '--xperf_path', 03:50:43 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:50:43 INFO - 'tests': ['tp5n']}, 03:50:43 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 03:50:43 INFO - 'talos_options': ['--xperf_path', 03:50:43 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:50:43 INFO - 'tests': ['tp5n']}}, 03:50:43 INFO - 'talos.zip': {'path': '', 03:50:43 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:50:43 INFO - Running post-action listener: _resource_record_post_action 03:50:43 INFO - [mozharness: 2017-02-25 11:50:43.280557Z] Finished populate-webroot step (success) 03:50:43 INFO - [mozharness: 2017-02-25 11:50:43.280686Z] Running create-virtualenv step. 03:50:43 INFO - Running pre-action listener: _resource_record_pre_action 03:50:43 INFO - Running main action method: create_virtualenv 03:50:43 INFO - Creating virtualenv /builds/slave/test/build/venv 03:50:43 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 03:50:43 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:50:43 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:50:43 INFO - Using real prefix '/tools/python27' 03:50:43 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:50:44 INFO - Installing distribute.............................................................................................................................................................................................done. 03:50:47 INFO - Installing pip.................done. 03:50:47 INFO - Return code: 0 03:50:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 03:50:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 03:50:47 INFO - Reading from file tmpfile_stdout 03:50:47 INFO - Output received: 03:50:47 INFO - pip 1.5.5 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 03:50:47 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:50:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:50:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:50:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:47 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:50:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 03:50:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 03:50:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:50:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:50:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:50:47 INFO - 'HOME': '/Users/cltbld', 03:50:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:50:47 INFO - 'LOGNAME': 'cltbld', 03:50:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:50:47 INFO - 'MOZ_NO_REMOTE': '1', 03:50:47 INFO - 'NO_EM_RESTART': '1', 03:50:47 INFO - 'PAGER': '/bin/cat', 03:50:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:50:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:50:47 INFO - 'PWD': '/builds/slave/test', 03:50:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:50:47 INFO - 'SHELL': '/bin/bash', 03:50:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:50:47 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:50:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:50:47 INFO - 'USER': 'cltbld', 03:50:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:50:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:50:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:50:47 INFO - 'XPC_FLAGS': '0x0', 03:50:47 INFO - 'XPC_SERVICE_NAME': '0', 03:50:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:50:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:50:47 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 03:50:47 INFO - Cleaning up... 03:50:47 INFO - Return code: 0 03:50:47 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:50:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:50:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:50:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:47 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:50:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 03:50:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 03:50:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:50:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:50:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:50:47 INFO - 'HOME': '/Users/cltbld', 03:50:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:50:47 INFO - 'LOGNAME': 'cltbld', 03:50:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:50:47 INFO - 'MOZ_NO_REMOTE': '1', 03:50:47 INFO - 'NO_EM_RESTART': '1', 03:50:47 INFO - 'PAGER': '/bin/cat', 03:50:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:50:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:50:47 INFO - 'PWD': '/builds/slave/test', 03:50:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:50:47 INFO - 'SHELL': '/bin/bash', 03:50:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:50:47 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:50:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:50:47 INFO - 'USER': 'cltbld', 03:50:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:50:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:50:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:50:47 INFO - 'XPC_FLAGS': '0x0', 03:50:47 INFO - 'XPC_SERVICE_NAME': '0', 03:50:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:50:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:50:47 INFO - Downloading/unpacking psutil>=3.1.1 03:50:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:50:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:50:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:50:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:50:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:50:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:50:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:50:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:50:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:50:51 INFO - Installing collected packages: psutil 03:50:51 INFO - Running setup.py install for psutil 03:50:51 INFO - building 'psutil._psutil_osx' extension 03:50:51 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 03:50:52 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 03:50:52 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 03:50:52 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 03:50:52 INFO - building 'psutil._psutil_posix' extension 03:50:52 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 03:50:52 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 03:50:52 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 03:50:52 INFO - ^ 03:50:52 INFO - 1 warning generated. 03:50:52 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 03:50:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:50:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:50:53 INFO - Successfully installed psutil 03:50:53 INFO - Cleaning up... 03:50:53 INFO - Return code: 0 03:50:53 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:50:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:50:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:50:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:53 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:50:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 03:50:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 03:50:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:50:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:50:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:50:53 INFO - 'HOME': '/Users/cltbld', 03:50:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:50:53 INFO - 'LOGNAME': 'cltbld', 03:50:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:50:53 INFO - 'MOZ_NO_REMOTE': '1', 03:50:53 INFO - 'NO_EM_RESTART': '1', 03:50:53 INFO - 'PAGER': '/bin/cat', 03:50:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:50:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:50:53 INFO - 'PWD': '/builds/slave/test', 03:50:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:50:53 INFO - 'SHELL': '/bin/bash', 03:50:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:50:53 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:50:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:50:53 INFO - 'USER': 'cltbld', 03:50:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:50:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:50:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:50:53 INFO - 'XPC_FLAGS': '0x0', 03:50:53 INFO - 'XPC_SERVICE_NAME': '0', 03:50:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:50:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:50:53 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:50:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:50:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:50:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:50:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:50:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:50:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:50:55 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:50:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:50:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:50:56 INFO - Installing collected packages: mozsystemmonitor 03:50:56 INFO - Running setup.py install for mozsystemmonitor 03:50:56 INFO - Successfully installed mozsystemmonitor 03:50:56 INFO - Cleaning up... 03:50:56 INFO - Return code: 0 03:50:56 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:50:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:50:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:50:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:56 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:50:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 03:50:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 03:50:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:50:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:50:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:50:56 INFO - 'HOME': '/Users/cltbld', 03:50:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:50:56 INFO - 'LOGNAME': 'cltbld', 03:50:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:50:56 INFO - 'MOZ_NO_REMOTE': '1', 03:50:56 INFO - 'NO_EM_RESTART': '1', 03:50:56 INFO - 'PAGER': '/bin/cat', 03:50:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:50:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:50:56 INFO - 'PWD': '/builds/slave/test', 03:50:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:50:56 INFO - 'SHELL': '/bin/bash', 03:50:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:50:56 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:50:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:50:56 INFO - 'USER': 'cltbld', 03:50:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:50:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:50:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:50:56 INFO - 'XPC_FLAGS': '0x0', 03:50:56 INFO - 'XPC_SERVICE_NAME': '0', 03:50:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:50:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:50:56 INFO - Downloading/unpacking jsonschema==2.5.1 03:50:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:50:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:50:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:50:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:50:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:50:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:50:59 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:50:59 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:50:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:50:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:50:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:50:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:50:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:50:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:50:59 INFO - Downloading functools32-3.2.3-2.tar.gz 03:50:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:50:59 INFO - warning: no files found matching '*.txt' 03:50:59 INFO - no previously-included directories found matching 'build' 03:50:59 INFO - no previously-included directories found matching 'dist' 03:50:59 INFO - no previously-included directories found matching '.git*' 03:50:59 INFO - Installing collected packages: jsonschema, functools32 03:50:59 INFO - Running setup.py install for functools32 03:50:59 INFO - warning: no files found matching '*.txt' 03:50:59 INFO - no previously-included directories found matching 'build' 03:50:59 INFO - no previously-included directories found matching 'dist' 03:50:59 INFO - no previously-included directories found matching '.git*' 03:50:59 INFO - Successfully installed jsonschema functools32 03:50:59 INFO - Cleaning up... 03:50:59 INFO - Return code: 0 03:50:59 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 03:50:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:50:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:50:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:50:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:50:59 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:50:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 03:50:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 03:50:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:50:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:50:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:50:59 INFO - 'HOME': '/Users/cltbld', 03:50:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:50:59 INFO - 'LOGNAME': 'cltbld', 03:50:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:50:59 INFO - 'MOZ_NO_REMOTE': '1', 03:50:59 INFO - 'NO_EM_RESTART': '1', 03:50:59 INFO - 'PAGER': '/bin/cat', 03:50:59 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:50:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:50:59 INFO - 'PWD': '/builds/slave/test', 03:50:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:50:59 INFO - 'SHELL': '/bin/bash', 03:50:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:50:59 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:50:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:50:59 INFO - 'USER': 'cltbld', 03:50:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:50:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:50:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:50:59 INFO - 'XPC_FLAGS': '0x0', 03:50:59 INFO - 'XPC_SERVICE_NAME': '0', 03:50:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:51:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:51:00 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 03:51:00 INFO - Cleaning up... 03:51:00 INFO - Return code: 0 03:51:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:51:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:51:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:51:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:00 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:51:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 03:51:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 03:51:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:51:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:51:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:51:00 INFO - 'HOME': '/Users/cltbld', 03:51:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:51:00 INFO - 'LOGNAME': 'cltbld', 03:51:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:51:00 INFO - 'MOZ_NO_REMOTE': '1', 03:51:00 INFO - 'NO_EM_RESTART': '1', 03:51:00 INFO - 'PAGER': '/bin/cat', 03:51:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:51:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:51:00 INFO - 'PWD': '/builds/slave/test', 03:51:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:51:00 INFO - 'SHELL': '/bin/bash', 03:51:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:51:00 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:51:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:51:00 INFO - 'USER': 'cltbld', 03:51:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:51:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:51:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:51:00 INFO - 'XPC_FLAGS': '0x0', 03:51:00 INFO - 'XPC_SERVICE_NAME': '0', 03:51:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:51:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:51:00 INFO - Downloading/unpacking blobuploader==1.2.4 03:51:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:51:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:51:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:51:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:51:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:51:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:51:03 INFO - Downloading blobuploader-1.2.4.tar.gz 03:51:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:51:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:51:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:51:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:51:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:51:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:51:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:51:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:51:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:51:03 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:51:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:51:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:51:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:51:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:51:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:51:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:51:04 INFO - Downloading docopt-0.6.1.tar.gz 03:51:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:51:04 INFO - Installing collected packages: blobuploader, requests, docopt 03:51:04 INFO - Running setup.py install for blobuploader 03:51:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:51:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:51:04 INFO - Running setup.py install for requests 03:51:05 INFO - Running setup.py install for docopt 03:51:05 INFO - Successfully installed blobuploader requests docopt 03:51:05 INFO - Cleaning up... 03:51:05 INFO - Return code: 0 03:51:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:51:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:51:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:51:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:05 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:51:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:51:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:51:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:51:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:51:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:51:05 INFO - 'HOME': '/Users/cltbld', 03:51:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:51:05 INFO - 'LOGNAME': 'cltbld', 03:51:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:51:05 INFO - 'MOZ_NO_REMOTE': '1', 03:51:05 INFO - 'NO_EM_RESTART': '1', 03:51:05 INFO - 'PAGER': '/bin/cat', 03:51:05 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:51:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:51:05 INFO - 'PWD': '/builds/slave/test', 03:51:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:51:05 INFO - 'SHELL': '/bin/bash', 03:51:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:51:05 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:51:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:51:05 INFO - 'USER': 'cltbld', 03:51:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:51:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:51:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:51:05 INFO - 'XPC_FLAGS': '0x0', 03:51:05 INFO - 'XPC_SERVICE_NAME': '0', 03:51:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:51:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:51:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:51:05 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-NgYGDV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:51:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:51:05 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-eq0ZRv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:51:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:51:05 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-HsRK8a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:51:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:51:05 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-ymsSIL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-pPdsGq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-tIHiQY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-MRfLlJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-b_SHS6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-l9bAcA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-0Rpmgl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-V5CZR4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-fWZBGq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-NydzIg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:51:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:51:06 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-STQ6ym-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:51:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:51:07 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-QXX8UT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:51:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:51:07 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-iDeFQV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:51:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:51:07 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-fS5ds7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:51:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:51:07 INFO - Running setup.py install for manifestparser 03:51:07 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:51:07 INFO - Running setup.py install for mozcrash 03:51:07 INFO - Running setup.py install for mozdebug 03:51:07 INFO - Running setup.py install for mozdevice 03:51:07 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:51:07 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:51:07 INFO - Running setup.py install for mozfile 03:51:08 INFO - Running setup.py install for mozhttpd 03:51:08 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:51:08 INFO - Running setup.py install for mozinfo 03:51:08 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:51:08 INFO - Running setup.py install for mozInstall 03:51:08 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:51:08 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:51:08 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:51:08 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:51:08 INFO - Running setup.py install for mozleak 03:51:08 INFO - Running setup.py install for mozlog 03:51:08 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:51:08 INFO - Running setup.py install for moznetwork 03:51:08 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:51:09 INFO - Running setup.py install for mozprocess 03:51:09 INFO - Running setup.py install for mozprofile 03:51:09 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:51:09 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:51:09 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:51:09 INFO - Running setup.py install for mozrunner 03:51:09 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:51:09 INFO - Running setup.py install for mozscreenshot 03:51:09 INFO - Running setup.py install for moztest 03:51:09 INFO - Running setup.py install for mozversion 03:51:09 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:51:09 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:51:09 INFO - Cleaning up... 03:51:09 INFO - Return code: 0 03:51:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:51:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:51:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:51:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:09 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:51:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:51:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:51:09 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:51:09 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:51:09 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:51:09 INFO - 'HOME': '/Users/cltbld', 03:51:09 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:51:09 INFO - 'LOGNAME': 'cltbld', 03:51:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:51:09 INFO - 'MOZ_NO_REMOTE': '1', 03:51:09 INFO - 'NO_EM_RESTART': '1', 03:51:09 INFO - 'PAGER': '/bin/cat', 03:51:09 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:51:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:51:09 INFO - 'PWD': '/builds/slave/test', 03:51:09 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:51:09 INFO - 'SHELL': '/bin/bash', 03:51:09 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:51:09 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:51:09 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:51:09 INFO - 'USER': 'cltbld', 03:51:09 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:51:09 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:51:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:51:09 INFO - 'XPC_FLAGS': '0x0', 03:51:09 INFO - 'XPC_SERVICE_NAME': '0', 03:51:09 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:51:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:51:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:51:10 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-wfCG52-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:51:10 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 03:51:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:51:10 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-sr7yYk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:51:10 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)) 03:51:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:51:10 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-pJW90y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:51:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:51:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:51:10 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-I9umCe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:51:10 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)) 03:51:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:51:10 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-OEzHnd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:51:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 03:51:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:51:10 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-0c6OoI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:51:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 03:51:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:51:10 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-gZS4oG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:51:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 03:51:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:51:10 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-qoQUgK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:51:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-HX1Xbr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:51:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-4wYw7i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:51:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-KvQ5I7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:51:11 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-cWaMbo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:51:11 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)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-_tBFe1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:51:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-BQO2_U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:51:11 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)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-WB9NjB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:51:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-nlynuK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:51:11 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)) 03:51:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:51:11 INFO - Running setup.py (path:/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/pip-1ardNs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:51:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 03:51:12 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)) 03:51:12 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)) 03:51:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:51:12 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)) 03:51:12 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)) 03:51:12 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:51:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:51:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:51:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:51:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:51:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:51:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:51:14 INFO - Downloading blessings-1.6.tar.gz 03:51:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:51:14 INFO - Installing collected packages: blessings 03:51:14 INFO - Running setup.py install for blessings 03:51:14 INFO - Successfully installed blessings 03:51:14 INFO - Cleaning up... 03:51:15 INFO - Return code: 0 03:51:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:51:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:51:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:51:15 INFO - Reading from file tmpfile_stdout 03:51:15 INFO - Current package versions: 03:51:15 INFO - blessings == 1.6 03:51:15 INFO - blobuploader == 1.2.4 03:51:15 INFO - docopt == 0.6.1 03:51:15 INFO - functools32 == 3.2.3-2 03:51:15 INFO - jsonschema == 2.5.1 03:51:15 INFO - manifestparser == 1.1 03:51:15 INFO - mozInstall == 1.12 03:51:15 INFO - mozcrash == 1.0 03:51:15 INFO - mozdebug == 0.1 03:51:15 INFO - mozdevice == 0.49 03:51:15 INFO - mozfile == 1.2 03:51:15 INFO - mozhttpd == 0.7 03:51:15 INFO - mozinfo == 0.9 03:51:15 INFO - mozleak == 0.1 03:51:15 INFO - mozlog == 3.4 03:51:15 INFO - moznetwork == 0.27 03:51:15 INFO - mozprocess == 0.24 03:51:15 INFO - mozprofile == 0.28 03:51:15 INFO - mozrunner == 6.13 03:51:15 INFO - mozscreenshot == 0.1 03:51:15 INFO - mozsystemmonitor == 0.3 03:51:15 INFO - moztest == 0.8 03:51:15 INFO - mozversion == 1.4 03:51:15 INFO - psutil == 3.1.1 03:51:15 INFO - requests == 1.2.3 03:51:15 INFO - wsgiref == 0.1.2 03:51:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:51:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:51:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:51:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:15 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:51:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 03:51:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:51:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:51:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:51:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:51:15 INFO - 'HOME': '/Users/cltbld', 03:51:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:51:15 INFO - 'LOGNAME': 'cltbld', 03:51:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:51:15 INFO - 'MOZ_NO_REMOTE': '1', 03:51:15 INFO - 'NO_EM_RESTART': '1', 03:51:15 INFO - 'PAGER': '/bin/cat', 03:51:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:51:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:51:15 INFO - 'PWD': '/builds/slave/test', 03:51:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:51:15 INFO - 'SHELL': '/bin/bash', 03:51:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:51:15 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:51:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:51:15 INFO - 'USER': 'cltbld', 03:51:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:51:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:51:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:51:15 INFO - 'XPC_FLAGS': '0x0', 03:51:15 INFO - 'XPC_SERVICE_NAME': '0', 03:51:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:51:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:51:15 INFO - Cleaning up... 03:51:15 INFO - Return code: 0 03:51:15 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:51:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:51:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:51:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:51:15 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 0x10c5b9b70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c5bc768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc5ba45d370>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, '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.6ssLNwRHAC/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.w2R71mCuVc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:51:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 03:51:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 03:51:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:51:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:51:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:51:15 INFO - 'HOME': '/Users/cltbld', 03:51:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:51:15 INFO - 'LOGNAME': 'cltbld', 03:51:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:51:15 INFO - 'MOZ_NO_REMOTE': '1', 03:51:15 INFO - 'NO_EM_RESTART': '1', 03:51:15 INFO - 'PAGER': '/bin/cat', 03:51:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:51:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:51:15 INFO - 'PWD': '/builds/slave/test', 03:51:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:51:15 INFO - 'SHELL': '/bin/bash', 03:51:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:51:15 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:51:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:51:15 INFO - 'USER': 'cltbld', 03:51:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:51:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:51:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:51:15 INFO - 'XPC_FLAGS': '0x0', 03:51:15 INFO - 'XPC_SERVICE_NAME': '0', 03:51:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:51:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:51:15 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:51:15 INFO - Cleaning up... 03:51:15 INFO - Return code: 0 03:51:15 INFO - Running post-action listener: _resource_record_post_action 03:51:15 INFO - Running post-action listener: _start_resource_monitoring 03:51:15 INFO - Starting resource monitoring. 03:51:15 INFO - [mozharness: 2017-02-25 11:51:15.890866Z] Finished create-virtualenv step (success) 03:51:15 INFO - [mozharness: 2017-02-25 11:51:15.891804Z] Running install step. 03:51:15 INFO - Running pre-action listener: _resource_record_pre_action 03:51:15 INFO - Running main action method: install 03:51:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:51:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:51:16 INFO - Reading from file tmpfile_stdout 03:51:16 INFO - Detecting whether we're running mozinstall >=1.0... 03:51:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:51:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:51:16 INFO - Reading from file tmpfile_stdout 03:51:16 INFO - Output received: 03:51:16 INFO - Usage: mozinstall [options] installer 03:51:16 INFO - Options: 03:51:16 INFO - -h, --help show this help message and exit 03:51:16 INFO - -d DEST, --destination=DEST 03:51:16 INFO - Directory to install application into. [default: 03:51:16 INFO - "/builds/slave/test"] 03:51:16 INFO - --app=APP Application being installed. [default: firefox] 03:51:16 INFO - mkdir: /builds/slave/test/build/application 03:51:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-53.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 03:51:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-53.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 03:51:36 INFO - Reading from file tmpfile_stdout 03:51:36 INFO - Output received: 03:51:36 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 03:51:36 INFO - Running post-action listener: _resource_record_post_action 03:51:36 INFO - [mozharness: 2017-02-25 11:51:36.422114Z] Finished install step (success) 03:51:36 INFO - [mozharness: 2017-02-25 11:51:36.422255Z] Running run-tests step. 03:51:36 INFO - Running pre-action listener: _resource_record_pre_action 03:51:36 INFO - Running main action method: run_tests 03:51:36 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:51:36 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:51:36 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:51:36 INFO - 2017-02-25 03:51:36.436 screenresolution[1665:14756] starting screenresolution argv=screenresolution get 03:51:36 INFO - 2017-02-25 03:51:36.439 screenresolution[1665:14756] Display 0: 1600x1200x32@60 03:51:36 INFO - 2017-02-25 03:51:36.445 screenresolution[1666:14759] starting screenresolution argv=screenresolution list 03:51:36 INFO - Available Modes on Display 0 03:51:36 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:51:36 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:51:36 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:51:36 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:51:36 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:51:36 INFO - Intel Iris: 03:51:36 INFO - Chipset Model: Intel Iris 03:51:36 INFO - Type: GPU 03:51:36 INFO - Bus: Built-In 03:51:36 INFO - VRAM (Dynamic, Max): 1536 MB 03:51:36 INFO - Vendor: Intel (0x8086) 03:51:36 INFO - Device ID: 0x0a2e 03:51:36 INFO - Revision ID: 0x0009 03:51:36 INFO - Displays: 03:51:36 INFO - Display: 03:51:36 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:51:36 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:51:36 INFO - Display Serial Number: 1600x1200 60 03:51:36 INFO - Main Display: Yes 03:51:36 INFO - Mirror: Off 03:51:36 INFO - Online: Yes 03:51:36 INFO - Rotation: Supported 03:51:36 INFO - Return code: 0 03:51:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:51:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:51:36 INFO - Python 2.7.3 03:51:36 INFO - Return code: 0 03:51:36 INFO - grabbing minidump binary from tooltool 03:51:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:51:36 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 0x10c397d30>, '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 0x10c2bedb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10c38cbe8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:51:36 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 03:51:36 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 03:51:36 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 03:51:36 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:51:36 INFO - Return code: 0 03:51:36 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 03:51:36 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:51:36 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:51:36 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 03:51:36 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:51:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0131', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 03:51:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0131 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 03:51:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.6ssLNwRHAC/Render', 03:51:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:51:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:51:36 INFO - 'HOME': '/Users/cltbld', 03:51:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:51:36 INFO - 'LOGNAME': 'cltbld', 03:51:36 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:51:36 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 03:51:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:51:36 INFO - 'MOZ_NO_REMOTE': '1', 03:51:36 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:51:36 INFO - 'NO_EM_RESTART': '1', 03:51:36 INFO - 'PAGER': '/bin/cat', 03:51:36 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:51:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:51:36 INFO - 'PWD': '/builds/slave/test', 03:51:36 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:51:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:51:36 INFO - 'SHELL': '/bin/bash', 03:51:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.w2R71mCuVc/Listeners', 03:51:36 INFO - 'TMPDIR': '/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/', 03:51:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:51:36 INFO - 'USER': 'cltbld', 03:51:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:51:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:51:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:51:36 INFO - 'XPC_FLAGS': '0x0', 03:51:36 INFO - 'XPC_SERVICE_NAME': '0', 03:51:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:51:36 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0131', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 03:51:37 INFO - mozversion application_buildid: 20170225020729 03:51:37 INFO - mozversion application_changeset: 329442feed2426f939cce4c4126a837573ff11da 03:51:37 INFO - mozversion application_display_name: FirefoxDeveloperEdition 03:51:37 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:51:37 INFO - mozversion application_name: Firefox 03:51:37 INFO - mozversion application_remotingname: firefox-dev 03:51:37 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:51:37 INFO - mozversion application_vendor: Mozilla 03:51:37 INFO - mozversion application_version: 53.0a2 03:51:37 INFO - mozversion platform_buildid: 20170225020729 03:51:37 INFO - mozversion platform_changeset: 329442feed2426f939cce4c4126a837573ff11da 03:51:37 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:51:37 INFO - mozversion platform_version: 53.0a2 03:51:37 INFO - using testdate: 1488023497 03:51:37 INFO - actual date: 1488023497 03:51:37 INFO - starting webserver on 'localhost:49255' 03:51:37 INFO - SUITE-START | Running 2 tests 03:51:37 INFO - TEST-START | dromaeo_css 03:51:37 INFO - operating with platform_type : mac_ 03:51:37 INFO - Initialising browser for dromaeo_css test... 03:51:37 INFO - TEST-INFO | started process 1676 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/tmpLz4y7i/profile http://localhost:49255/getInfo.html) 03:51:39 INFO - PROCESS | 1676 | __metrics Screen width/height:1600/1200 03:51:39 INFO - PROCESS | 1676 | colorDepth:24 03:51:39 INFO - PROCESS | 1676 | Browser inner width/height: 1024/689 03:51:39 INFO - PROCESS | 1676 | __metrics 03:51:39 INFO - PROCESS | 1676 | 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" 03:51:39 INFO - PROCESS | 1676 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:51:40 INFO - TEST-INFO | 1676: exit 0 03:51:40 INFO - Browser initialized. 03:51:40 INFO - Running cycle 1/1 for dromaeo_css test... 03:51:40 INFO - TEST-INFO | started process 1680 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/tmpLz4y7i/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:51:52 INFO - PROCESS | 1680 | RSS: Main: 212746240 03:51:52 INFO - PROCESS | 1680 | 03:54:56 INFO - PROCESS | 1680 | Cycle 1(1): loaded http://localhost:49255/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49255/tests/dromaeo/cssquery-ext.html) 03:54:57 INFO - PROCESS | 1680 | RSS: Main: 339435520 03:54:57 INFO - PROCESS | 1680 | 03:56:42 INFO - PROCESS | 1680 | ************************* 03:56:42 INFO - PROCESS | 1680 | A coding exception was thrown and uncaught in a Task. 03:56:42 INFO - PROCESS | 1680 | 03:56:42 ERROR - PROCESS | 1680 | Full message: TypeError: NetworkError when attempting to fetch resource. 03:56:42 INFO - PROCESS | 1680 | Full stack: 03:56:42 INFO - PROCESS | 1680 | ************************* 03:58:00 INFO - PROCESS | 1680 | Cycle 1(1): loaded http://localhost:49255/tests/dromaeo/cssquery-ext.html (next: http://localhost:49255/tests/dromaeo/cssquery-jquery.html) 03:58:01 INFO - PROCESS | 1680 | RSS: Main: 358612992 03:58:01 INFO - PROCESS | 1680 | 04:01:03 INFO - PROCESS | 1680 | Cycle 1(1): loaded http://localhost:49255/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49255/tests/dromaeo/cssquery-mootools.html) 04:01:03 INFO - PROCESS | 1680 | RSS: Main: 350195712 04:01:03 INFO - PROCESS | 1680 | 04:04:06 INFO - PROCESS | 1680 | Cycle 1(1): loaded http://localhost:49255/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49255/tests/dromaeo/cssquery-prototype.html) 04:04:06 INFO - PROCESS | 1680 | RSS: Main: 333852672 04:04:06 INFO - PROCESS | 1680 | 04:07:10 INFO - PROCESS | 1680 | Cycle 1(1): loaded http://localhost:49255/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49255/tests/dromaeo/cssquery-yui.html) 04:07:11 INFO - PROCESS | 1680 | RSS: Main: 308531200 04:07:11 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | Cycle 1(1): loaded http://localhost:49255/tests/dromaeo/cssquery-yui.html (next: http://localhost:49255/tests/dromaeo/cssquery-dojo.html) 04:10:14 INFO - PROCESS | 1680 | RSS: Main: 407023616 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | __start_tp_report 04:10:14 INFO - PROCESS | 1680 | _x_x_mozilla_page_load 04:10:14 INFO - PROCESS | 1680 | _x_x_mozilla_page_load_details 04:10:14 INFO - PROCESS | 1680 | |i|pagename|runs| 04:10:14 INFO - PROCESS | 1680 | |0;dojo.html;2832.4335132973406;3307.570015897932;3347.8493467793946;3355.614104377997;3390.898273051808;5614.943850561498;5626.240457538231;5674;5682.659040457575;5700.8859822803515;5675.290588676416;5742.856428589287;5758.769649214027;5758.884822303551;5801.303843538782;5166.225066240066;5166.457521960197;5204.765785539641;5224.085784987631;5253.527182553569;5118.769655365499;5144.459831717653;5154.896902061956;5283.55089817364;5341.626086173969;5152.381714194302;5220.112580861262;5222.321098257221;5226.973865130669;5230.215467679859;5203.895922081556;5217.37391513019;5232.869178270574;5237.502437268454;5243.475652434764;5083.135866902636;5176.8964620707375;5193.610479214036;5207.140821764404;5237.397699264595;5581.413951535071;5615.410381909923;5616.747246373923;5637.3517045539875;5681.545476361881;6136.163923949498;6147;6156.3843615638525;6195.163652906845;6220.409061139185;5455.754491047913;6178.38216178383;6251.218597675291;6255.593386429868;6271.090691849702;5764.51001664859;5817.243758311392;5818.796342128006;5824.825255242307;5844.853878653068;6139.1064578004725;6144.341027922436;6204.534659900435;6226.40849119333;6228.968855155696;6111.297200821873;6132.5509216291;6135.153079307736;6137.757446213422;6141.915626108588;6191.938080619136;6254.030625253093;6254.9687251563455;6257.0614407838275;6265.498760099181;6102.176206212193;6119.41115851624;6201.875962480725;6207.844803879849;6225.533085018642;6128.167033931239;6136.21274067861;6136.3965394158;6141.201643786279;6225.595336303217;4978.253262010728;4982.402111746614;4982.729404001956;4986.750662466862;5011.448740638527;4425.137098265807;4429.025614364835;4437.312216606431;4452.710573812692;4475.485319188335;5077.339945807095;5711.3146422428745;5724.713764311768;5766.567507436959;5769.769209231584;6194.690265486708;6204.472619827275;6228.937710622927;6240.344763799826;6248.031555108965;5612.242347283064;5637.9718101409235;5649.943500565024;5761.222234998221;5854.970725146347;5415.350157981067;5456.290682211366;5483.945160548423;5515.172724091338;5527.944720552823;6136.243373036893;6185.350538193605;6185.783497577563;6257.1240026395435;6267.561270711007;6120.782376608402;6210.720517576629;6229.2524897010835;6243.625382477066;6243.656598887105;6248.468880145057;6270.811875643738;6273.905891411724;6282.120503129474;6288.27684816252;6042.365551617193;6120.296165940974;6165.075238714228;6180.196574445294;6188.071789231652;6186.597871138361;6200.193974783249;6219.626822390671;6246.656433896179;6248.968755156195;6109.480694141048;6110.480609148272;6117.602355846856;6122.908156377569;6146.323904370605;6048.758049678139;6060.0305850134;6121.959266924722;6146.0473626587955;6151.26184857802;5785.074388097884;5842.912356314574;5852.590318677822;5890.352061273342;5955.583109182489;5854.531637469077;6037.939620603738;6049.0926361046195;6065.909011364744;6067.969660151671;5880.911786323294;5887.52899768009;5893.9115913260475;5896.262967129109;5900.380460051632 04:10:14 INFO - PROCESS | 1680 | |1;ext.html;465.80203413549236;478.1918557637591;514.7117614136084;521.4212224430879;524.1142469227009;27919.02283420081;40314.59685403145;41775;41803.58196418035;41913.37129943046;43933.56066439335;44039.89900252495;44218.557814421845;44250.778746106225;44297.55702442975;8334.458260213098;9241.584128714207;9419.29355298352;9434.622615095388;9444.622215111387;8437.493750374966;11183.720406989809;11434.085273178167;11439.771204575904;11633.418329083554;11339.37633430161;11425.42872856358;11427.200095993283;11435.656930292063;11445.542178312857;7329.45029122818;8650.524221167832;11389.601363952263;11439.485223164978;11465.025472834819;11060.336379817236;11335.093192544577;11346.546138154465;11537.769244615061;11575.594854180148;41307.58692413067;41714.957126071786;41742.95642608929;41823.37264941028;41969.580304196876;3425.74306926979;3955.920881582352;3980.8098406977138;4001.4998125234347;4115.176964607091;28910.85544572264;29858.70141298581;29869.103926882228;29889.25276868074;30301.545476817864;3176.126565194567;3185.792923459968;3237.4172648923186;3255.12111729834;3279.6884295991845;479045.9999999965;479807;479962;480151.9999999965;481600;60882.08676869851;61066.69466652638;61182;61235.38764612297;61371.38628613746;67778;67879.66060169667;67893;67901;68038.31961680419;16551.751723724155;16767.413140540022;16802.57993550171;16808.74786878198;16824.327026918785;11566.884331156749;11863.88136118645;12894.742105157844;12967.351632418342;12974.221546707227;15833.683326333408;17407.73888391675;18013.7297940531;18042.368517101837;18521.35175268859;5501.312335958005;5847.94152058474;5994.190784244071;6669.466442684574;6731.932680673131;857.1642648417867;881.6781874615847;887.9156480134377;898.820235952812;919.9724008279762;29929.251768705955;29981.850090749842;30257;30358.61071771674;30374.69625303763;1053.320608207717;1062.102523367753;1073.3398959639765;1077.515118196799;1195.8460086016862;15687;15701.371945122295;15932.681346373007;15954.601134971486;15985.520434386986;619743;625220;627193;628258;628878;62685.686571566854;62743.6862815683;62797.68601156965;62965.68517157385;64048.67975660092;1404.150488954168;1439.7264519741216;1460.1531111954828;1463.2464280895347;1470.3824393754649;26359.472810544066;28887.40013398804;29280.41439171162;29705.405891882474;29721;46566;46618.533814661416;46632.533674662816;53183.73408132935;53447.7327613375;536369;536693.3165334305;537361.3131934315;539018;540722;40817.59182408138;41357.58642413537;41655.37516937309;41661.58338416698;41713.1657366857;39446.80276598714;46567.83580410517;46911.29633055575;47418;47917.5208247913;30026.39947201;37862;38126;38155.046123847125;38596.68348667214;37992.81003595075;38393.84818455451;39108.80445597754;39539.40690889581;39576.042395760196;37720.81139594394;38274.42588361121;38553.2289354217;38645.22709545737;38658.6134138655;30584.388312234074;32220.355592887543;33490.33019339551;34527.482087769204;34532.482012769324;21782;23445.06219751191;23655.881720591286;24658.566450033195;25157.496850063264 04:10:14 INFO - PROCESS | 1680 | |2;jquery.html;325.64829983617693;393.4236343756396;394.7907608967247;403.3163787380391;424.4842516342645;12941.676458088552;14719.779203311959;16446.588835279108;20029.198832046735;20195.697064544045;17654.735178972325;21387.465313367175;21538.89230553849;21714.89142554285;21905.233316833914;5746.051901436258;5836.124581312805;6027.126066720323;6051.304100028509;6074.42292982166;5931.347551769302;5999.040153575429;6043.3956604339655;6045.33501314855;6066.09008648704;4193.43388642534;4401.86794396167;6374.266959299694;6623.834404139911;6663.966680166593;6452.677366131675;6625.337466253384;6725.899111513331;6733.259341472434;6734.797956061326;5835;5841;5843;5843.912341314884;5848.67832269225;25075.373115672253;25668.486630267478;25762.484750304888;25810.612840807404;25974.87012564944;2793.0782841662203;2810.6486689163853;2816.478951393978;2817.9577306340216;2820.7179282071834;14782;15240.46658366963;15339.386424543116;15810.604734881605;15938.681226375524;1620.1575180905863;1791.6058467137339;1804.9639007219782;1806.349714102922;1815.210383483189;121945.39027304806;123295.15057274148;128124.35937820344;128670.99999999907;132013;11373.94313028446;11467.770644587228;11539.826902596467;11570.537178512934;11706.941465292619;14475.493357732428;14493.565193044225;14497.202653853928;14524.49164279245;14543.78184327236;8442.704505342284;8581.184787445183;8657.307415406753;8669.956650216835;8722.302215822845;8549.273311768446;8559.614817333235;8563.95718021406;8739.038705742363;8764;6136.662483563447;6883.556337500216;7030.824229394306;7065.364117229474;7083.716651333889;1909.2458478901035;1957.716131161002;1959.2456904092028;1959.931402400909;1960.8431325493925;857.691231156783;902.1564836877541;907.8002839375326;909.6816114359921;914.2685851319051;20186.39440816778;21487.57024859494;21606.351809445743;21699.240526581492;21718.006461374243;905.912904514572;917.8531434970373;934.63082082577;956.5026186383042;957.2103015012642;10750.73123171927;11351.602693905674;11362.65912022624;11405.486753096131;11437.885621143849;707617;710965;714977;723838;744239;125778;125920;127915.36042319729;128611;128879;997.6209040564684;1022.1005515146624;1037.2376303416982;1041.2034793383068;1043.76515284062;18089.45731628053;19122.235110595422;19129.617407652047;19234.23063077517;19360.8063919359;45366.77316613396;54432.727836360566;54589;55772.88454230974;55859.72070139623;59586;75773.62113189399;76159.61920190364;76798.23201768134;79845;7928.682852686059;7997.920020799717;8235.258826705625;8348.916510834813;8508.702195423379;13045.739085218433;13410.798838017632;13495.865041349462;13814.171149731048;13843.930780346436;11211.327320360804;11399.373034482851;11583.478743456733;11760.76478470443;11835.349055802013;11342.546298147981;11385.430728463378;11575.826362604399;11756.764864702829;11893.405329733305;11391.259568128045;11465.31208127515;11539.596114135966;11590;11625.941870290595;7911.248431399008;7990.961175047207;8083.757487275391;8510.319174465903;8574.828503429771;10848.891511084788;11014;11026.173037022096;11131.220814542905;11566.363849988331 04:10:14 INFO - PROCESS | 1680 | |3;mootools.html;1309.423853504458;1423.2812429722987;1443.0259574787017;1447.8769304609102;1449.202938383889;7966.482178658383;8285.295749861254;8370.414071015031;8389.958050209756;8397.874031889527;7349.926500734991;7577.545347279153;7596.468247222697;7884.132745398016;8198.1801819818;2197.165077270639;2283.6526449394855;2286.222684287342;2288.233441796992;2288.496530763238;2261.8464583062673;2296.402935236842;2299.206773663092;2301.091069027733;2302.2057390200353;2010.3566858605252;2087.1338394566237;2209.215728416413;2248.291788086756;2267.761885002076;2278.7721227877246;2291.232437133562;2292.1633603734685;2297.7127859017623;2298.310506847956;2207.249535158054;2254.1884921428273;2257.492064285539;2288.6567014947723;2293.5550603119927;8143.063547691972;8254.917450825475;8270;8270.37972152091;8288.917110828876;4910.631702622318;5063.696178229318;5063.746812659352;5068.974655126738;5073.441921388644;2863.21261653045;3205.983970080135;3376.729861611065;3440.449528075496;3442.019024578008;1126.5099681638515;1167.7255844876447;1220.6948262934266;1226.51552636708;1232.9568465103678;10673.306235094695;10693.251472396936;10713.982171693677;10719.517621707042;10727.141828653688;4072.124493233969;4472.798724057425;4547.47704014036;4597.42532183477;4670.883227919261;9273.953630231807;9433.386829856037;9433.48115853621;9438.339316247933;9458.196053335407;5154.458781827929;5161.122609156452;5163.122269214243;5169.431362550116;5169.4830516948;4591.747453890068;4603.838865639686;4613.515580864028;4650.18621741194;4752.1921273383605;3716.7026637868908;3777.7544459610585;3791.7156213284115;3856.2287542491613;3870.8838734837436;1199.8260252263374;1215.2743104791218;1215.428748488209;1219.5975328141692;1234.666640007193;840.7225615546855;872.4024043530202;882.0914458108159;902.4675441489553;926.7389999355128;5319.946800532022;5422.43064478232;5581.804636837773;5591.608587398924;5645.5483561314995;492.7659361803115;554.3790954131399;565.6266863869909;588.1325045557768;590.7725525672647;2943.2641839540115;3429.2798512312197;3662.212624285791;3679.521662183899;3755.7746535207975;9534.046595340411;9929.553170107363;9948.005199479994;9961.203103751683;9970.202383809277;9480.24158067353;9685;9897.257705672104;9952.452615106095;9976.05227503386;7196.136463624399;7435.628218589157;7680.731174408869;7801.80495487606;7837.608119593998;5285.735713214401;5421;5468.972655136698;5505.834824955257;5507.091329930677;7630.084389873251;8956.820863582821;9004.86492702623;9098.545072746203;9231.123043310874;8542.530160841214;8815.691450799191;9099.49952752605;9158.771030724285;9225.861612075958;7088.0076789248515;7203.819904502429;7207.8558428832175;7210.242924492853;7238.746643867439;7428.071491063617;7675.961620191863;7725.1502334744255;7744.303012728656;7872.803179920548;6823.4882383822405;7056.611886346095;7113.502054856111;7129.607871566906;7169.892451613335;6191.9690401547705;6957.1651401832105;7006.614636195059;7086.539374940612;7114.928850711427;6144.600600960924;6148.3236843948025;6159.384061593805;6179.969100154471;6199.845003874939;4727.834525791718;4745.145873742759;4922.145155809693;4928.531789479994;5111.080005598879;4875.609951203966;4930.112579735682;5013.072581572421;5063.265826455217;5071.163258062378 04:10:14 INFO - PROCESS | 1680 | |4;prototype.html;295.3207622468323;327.12983463985773;349.6789006249068;361.6166863125087;367.1408903166591;4223.493180818298;5047.495250474951;5125.666831655944;5341.973290133554;5431.565474762019;4927.605791536677;4957.380327459067;4987.852793857415;5066.392032956051;5282.920756188661;3594.5506811648543;4055.655269302113;4060.654844338235;4073.6130067643526;4091.977005748563;3893.552241492222;3954.604539546051;4021.698372622065;4079.3473044312914;4097.504410890018;3873.496445462086;4033.5764744701823;4043.737157084795;4045.2314060328445;4054.9391759123637;3604.7656902301264;3691.335559599271;3998.3602623580086;4044.757314561136;4061.2283666103344;3155.5897733294523;3336.4828451590042;3406.914827129317;3443.7933723976644;3530.6583498270747;4369.0023628379995;4749.810007599692;5104.540591346797;5133.947540754137;5135.255387968761;4621.607163391116;4632.86101416958;4651.558101980307;4652.278896771006;4664.55686709762;5221.869453263699;5426.996005738951;5430.551599734158;5515.365732940683;5556.194236873032;3819.949513883704;3825.3305671507374;3836.5971572984713;3843.500344955166;3853.5761066282685;5063.139266324733;5897.7935772247765;5909.995300798874;5911.231539899829;5918.437748413937;3317.8838740644446;3742.476053352478;3923.6272554107313;3926.7447615904875;3938.9803050985133;3518.1732292911147;3766.9640848766808;3940.4286378474962;3968.8214030368704;3977.940330895039;3875.379939209713;4491.640668746492;4518.864434066983;4595.885102872455;4607.521321402387;5016.799328026838;5682;5687.744051517609;5694.829155125353;5709.115087161496;1252.906032047582;1255.3911352993791;1267.480333063458;1287.922724636525;1295.7602843473987;855.7347222361088;865.385576240876;867.2395038072723;874.0734821089666;887.9067697891628;4532.297493888453;4747.620190384761;4782.402199725035;5001.874953126128;5057.039162559102;4588;4997.750112494361;5365.758540865592;5610.607257492018;5644.379118296984;4638.536146385334;4718.867471806741;4954.860382112134;5089.440161582223;5147.279380886679;2675.331167208198;2900.883964641433;2917.2140605721484;2934;2957.33459971509;5267.841964741064;5392.568594512508;5527.346873500742;5819.5053420459735;5895.469407753237;4893.926591101136;5489.505944465017;5731.828045158652;5937.033281552099;5939.07944268639;5457.263269458731;5974.954382983047;5978.850528736816;5979.760809567656;6062.969685151546;5084.779652883355;5380.067863014745;5794.131904707028;5795.1017592273265;5800.940666063487;4916.557509824133;5270.8155214567305;5706.857328566819;5709.4861462466915;5709.974468000133;6013.819585412444;6030.788922387871;6031.969840150947;6032.065029920369;6070.7875224366935;3684.299983003221;3866.4780254666384;3889.611038896201;3908.902277443087;3910.96089039106;5530.806421775219;5743.655380677173;5759.596828221985;5764.279465066867;5818.24362832846;4770.761461926959;5559.8888022240135;5633.887322253614;5650.604457688087;5687.364797689869;5591.944080559142;5596.3284405871555;5602.2717046783655;5615.915761263666;5628.802991895264;4788.329633851334;5196.9740151299;5469.972650136724;5506.394296627448;5546.889062218653;4680.251159814414;5421.891562168814;5608.990381731328;5656;5774.94225057744;4629.814807407801;4881.925181797651;4965.219477092695;5554.333479982428;5565.5825813063375 04:10:14 INFO - PROCESS | 1680 | |5;yui.html;694.3646563394494;718.2888939949448;741.9814504637384;755.3994574313421;837.7779888329592;14404;15285.006474579159;15288.159151246677;15309.311081001353;15323.004004739683;14027.649308767286;14095.929520352383;14121.364538595762;14147;14161.362738676758;842.1241908415241;854.5855260198798;856.4989481153533;856.5674334461088;857.9957100214522;676.0231465532307;696.5437638346865;853.2193043365313;854.9871751923727;855.7946092937713;727.0983979864982;786.2059320086724;862.560094351882;885.7953183670203;894.4901406198469;898.6225785170211;900.6037343568809;901.8827552418144;902.0798785239052;903.1420150856646;670.5473805181483;671.0906721392491;671.711164199394;671.8790617688815;672.5561129654453;11665.24175928562;12140.635780926586;14104.153750774987;14611.78082328766;14656.267186640733;13999.930000350036;14002.649933751738;14080.084794488326;14141.29293535319;14210.431582736677;11020.889791102067;11028.44857757109;11129.276597021168;11437.256578322465;11828.763424731456;3600.837962291703;3765.1904840459433;3810.771353718758;3882.437046628223;3883.165119499321;84826;92560.24171598344;100454.4977275109;102417;102817.94364112751;10644.94677526623;10866.185036122322;11072.833907491395;11095.223334366518;11664.241824281395;22050.228242011453;22074.779252207594;22264.443388915406;22427.663585046237;22449.32652020442;7352.705891764376;7450.2549745026145;7509.962450187714;7578.317951384402;7667.961660191663;4056.858009969637;4067.349224124126;4171.541130475645;4192.224438478891;4198.538160802309;3512.1921957949817;3631.618680038611;3632;3634.636536346397;3634.818259087035;522.9450907654641;645.8772833161685;647.4787795824312;648.6075924065872;657.0472814419112;629.2920464477463;658.2298710508717;682.8019874236516;686.2245662401455;687.9690413931385;9739.123478886793;9909.900900990899;10076;10155.390676559282;10204.897951020543;646.7606985415426;651.1307404614893;665.5723026414007;679.7247114918466;687.2646268492665;4496.595306422372;4907.312976183337;4916.385451818523;4940.283658869515;4963.627727920348;101472;105970.47014765031;107424;107534.46232768786;108484;89285.9999999987;92110.15779684369;92212.53893730488;92418;93626.53186734159;80115;80658.59670701608;82349;83078.16921830825;83235.5838220805;9314.612397884684;9636.357295522585;9645.357694006174;9656.282445516137;9762.755931101496;37655.870323890325;46125.769371154274;54110.72944635252;54770;55361;63226;66041;66492.33507664861;68202.3179768196;68222.65888670525;12776.936115319364;12842.357882106044;12849.35753212317;13196.868031319947;13277;14244.928775356057;14249.38416890239;14267.07264027835;14745.523839771362;14900.776488352467;13189.934050329686;13447.327633618084;13512.391942362421;13610;13756.449742010207;12731.61805145847;12788.936055319664;13450.596482105553;13595.184288942695;13962.650933726738;12835.93582032084;12965.22208667483;13010.414531345923;13086.541971030969;13090.083694141318;9451.87871782877;10748.570057197625;11147.331160130418;11149.386783726974;11229.21395502307;9527.57125929321;10436.321639093434;10647.574097036031;10869.130469562575;10875.945620271848 04:10:14 INFO - PROCESS | 1680 | __end_tp_report 04:10:14 INFO - PROCESS | 1680 | __start_cc_report 04:10:14 INFO - PROCESS | 1680 | _x_x_mozilla_cycle_collect,1337 04:10:14 INFO - PROCESS | 1680 | __end_cc_report 04:10:14 INFO - PROCESS | 1680 | __startTimestamp1488024614310__endTimestamp 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | ------- Summary: start ------- 04:10:14 INFO - PROCESS | 1680 | Number of tests: 6 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | [#0] dojo.html Cycles:165 Average:5720.08 Median:5890.35 stddev:635.94 (10.8%) stddev-sans-first:596.18 04:10:14 INFO - PROCESS | 1680 | Values: 2832.4 3307.6 3347.8 3355.6 3390.9 5614.9 5626.2 5674.0 5682.7 5700.9 5675.3 5742.9 5758.8 5758.9 5801.3 5166.2 5166.5 5204.8 5224.1 5253.5 5118.8 5144.5 5154.9 5283.6 5341.6 5152.4 5220.1 5222.3 5227.0 5230.2 5203.9 5217.4 5232.9 5237.5 5243.5 5083.1 5176.9 5193.6 5207.1 5237.4 5581.4 5615.4 5616.7 5637.4 5681.5 6136.2 6147.0 6156.4 6195.2 6220.4 5455.8 6178.4 6251.2 6255.6 6271.1 5764.5 5817.2 5818.8 5824.8 5844.9 6139.1 6144.3 6204.5 6226.4 6229.0 6111.3 6132.6 6135.2 6137.8 6141.9 6191.9 6254.0 6255.0 6257.1 6265.5 6102.2 6119.4 6201.9 6207.8 6225.5 6128.2 6136.2 6136.4 6141.2 6225.6 4978.3 4982.4 4982.7 4986.8 5011.4 4425.1 4429.0 4437.3 4452.7 4475.5 5077.3 5711.3 5724.7 5766.6 5769.8 6194.7 6204.5 6228.9 6240.3 6248.0 5612.2 5638.0 5649.9 5761.2 5855.0 5415.4 5456.3 5483.9 5515.2 5527.9 6136.2 6185.4 6185.8 6257.1 6267.6 6120.8 6210.7 6229.3 6243.6 6243.7 6248.5 6270.8 6273.9 6282.1 6288.3 6042.4 6120.3 6165.1 6180.2 6188.1 6186.6 6200.2 6219.6 6246.7 6249.0 6109.5 6110.5 6117.6 6122.9 6146.3 6048.8 6060.0 6122.0 6146.0 6151.3 5785.1 5842.9 5852.6 5890.4 5955.6 5854.5 6037.9 6049.1 6065.9 6068.0 5880.9 5887.5 5893.9 5896.3 5900.4 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | [#1] ext.html Cycles:180 Average:69142.86 Median:38883.71 stddev:147004.09 (378.1%) stddev-sans-first:147326.04 04:10:14 INFO - PROCESS | 1680 | Values: 465.8 478.2 514.7 521.4 524.1 27919.0 40314.6 41775.0 41803.6 41913.4 43933.6 44039.9 44218.6 44250.8 44297.6 8334.5 9241.6 9419.3 9434.6 9444.6 8437.5 11183.7 11434.1 11439.8 11633.4 11339.4 11425.4 11427.2 11435.7 11445.5 7329.5 8650.5 11389.6 11439.5 11465.0 11060.3 11335.1 11346.5 11537.8 11575.6 41307.6 41715.0 41743.0 41823.4 41969.6 3425.7 3955.9 3980.8 4001.5 4115.2 28910.9 29858.7 29869.1 29889.3 30301.5 3176.1 3185.8 3237.4 3255.1 3279.7 479046.0 479807.0 479962.0 480152.0 481600.0 60882.1 61066.7 61182.0 61235.4 61371.4 67778.0 67879.7 67893.0 67901.0 68038.3 16551.8 16767.4 16802.6 16808.7 16824.3 11566.9 11863.9 12894.7 12967.4 12974.2 15833.7 17407.7 18013.7 18042.4 18521.4 5501.3 5847.9 5994.2 6669.5 6731.9 857.2 881.7 887.9 898.8 920.0 29929.3 29981.9 30257.0 30358.6 30374.7 1053.3 1062.1 1073.3 1077.5 1195.8 15687.0 15701.4 15932.7 15954.6 15985.5 619743.0 625220.0 627193.0 628258.0 628878.0 62685.7 62743.7 62797.7 62965.7 64048.7 1404.2 1439.7 1460.2 1463.2 1470.4 26359.5 28887.4 29280.4 29705.4 29721.0 46566.0 46618.5 46632.5 53183.7 53447.7 536369.0 536693.3 537361.3 539018.0 540722.0 40817.6 41357.6 41655.4 41661.6 41713.2 39446.8 46567.8 46911.3 47418.0 47917.5 30026.4 37862.0 38126.0 38155.0 38596.7 37992.8 38393.8 39108.8 39539.4 39576.0 37720.8 38274.4 38553.2 38645.2 38658.6 30584.4 32220.4 33490.3 34527.5 34532.5 21782.0 23445.1 23655.9 24658.6 25157.5 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | [#2] jquery.html Cycles:180 Average:38819.95 Median:25715.49 stddev:119308.47 (464.0%) stddev-sans-first:119608.15 04:10:14 INFO - PROCESS | 1680 | Values: 325.6 393.4 394.8 403.3 424.5 12941.7 14719.8 16446.6 20029.2 20195.7 17654.7 21387.5 21538.9 21714.9 21905.2 5746.1 5836.1 6027.1 6051.3 6074.4 5931.3 5999.0 6043.4 6045.3 6066.1 4193.4 4401.9 6374.3 6623.8 6664.0 6452.7 6625.3 6725.9 6733.3 6734.8 5835.0 5841.0 5843.0 5843.9 5848.7 25075.4 25668.5 25762.5 25810.6 25974.9 2793.1 2810.6 2816.5 2818.0 2820.7 14782.0 15240.5 15339.4 15810.6 15938.7 1620.2 1791.6 1805.0 1806.3 1815.2 121945.4 123295.2 128124.4 128671.0 132013.0 11373.9 11467.8 11539.8 11570.5 11706.9 14475.5 14493.6 14497.2 14524.5 14543.8 8442.7 8581.2 8657.3 8670.0 8722.3 8549.3 8559.6 8564.0 8739.0 8764.0 6136.7 6883.6 7030.8 7065.4 7083.7 1909.2 1957.7 1959.2 1959.9 1960.8 857.7 902.2 907.8 909.7 914.3 20186.4 21487.6 21606.4 21699.2 21718.0 905.9 917.9 934.6 956.5 957.2 10750.7 11351.6 11362.7 11405.5 11437.9 707617.0 710965.0 714977.0 723838.0 744239.0 125778.0 125920.0 127915.4 128611.0 128879.0 997.6 1022.1 1037.2 1041.2 1043.8 18089.5 19122.2 19129.6 19234.2 19360.8 45366.8 54432.7 54589.0 55772.9 55859.7 59586.0 75773.6 76159.6 76798.2 79845.0 7928.7 7997.9 8235.3 8348.9 8508.7 13045.7 13410.8 13495.9 13814.2 13843.9 11211.3 11399.4 11583.5 11760.8 11835.3 11342.5 11385.4 11575.8 11756.8 11893.4 11391.3 11465.3 11539.6 11590.0 11625.9 7911.2 7991.0 8083.8 8510.3 8574.8 10848.9 11014.0 11026.2 11131.2 11566.4 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | [#3] mootools.html Cycles:180 Average:5322.17 Median:5227.61 stddev:2924.76 (55.9%) stddev-sans-first:2917.42 04:10:14 INFO - PROCESS | 1680 | Values: 1309.4 1423.3 1443.0 1447.9 1449.2 7966.5 8285.3 8370.4 8390.0 8397.9 7349.9 7577.5 7596.5 7884.1 8198.2 2197.2 2283.7 2286.2 2288.2 2288.5 2261.8 2296.4 2299.2 2301.1 2302.2 2010.4 2087.1 2209.2 2248.3 2267.8 2278.8 2291.2 2292.2 2297.7 2298.3 2207.2 2254.2 2257.5 2288.7 2293.6 8143.1 8254.9 8270.0 8270.4 8288.9 4910.6 5063.7 5063.7 5069.0 5073.4 2863.2 3206.0 3376.7 3440.4 3442.0 1126.5 1167.7 1220.7 1226.5 1233.0 10673.3 10693.3 10714.0 10719.5 10727.1 4072.1 4472.8 4547.5 4597.4 4670.9 9274.0 9433.4 9433.5 9438.3 9458.2 5154.5 5161.1 5163.1 5169.4 5169.5 4591.7 4603.8 4613.5 4650.2 4752.2 3716.7 3777.8 3791.7 3856.2 3870.9 1199.8 1215.3 1215.4 1219.6 1234.7 840.7 872.4 882.1 902.5 926.7 5319.9 5422.4 5581.8 5591.6 5645.5 492.8 554.4 565.6 588.1 590.8 2943.3 3429.3 3662.2 3679.5 3755.8 9534.0 9929.6 9948.0 9961.2 9970.2 9480.2 9685.0 9897.3 9952.5 9976.1 7196.1 7435.6 7680.7 7801.8 7837.6 5285.7 5421.0 5469.0 5505.8 5507.1 7630.1 8956.8 9004.9 9098.5 9231.1 8542.5 8815.7 9099.5 9158.8 9225.9 7088.0 7203.8 7207.9 7210.2 7238.7 7428.1 7676.0 7725.2 7744.3 7872.8 6823.5 7056.6 7113.5 7129.6 7169.9 6192.0 6957.2 7006.6 7086.5 7114.9 6144.6 6148.3 6159.4 6180.0 6199.8 4727.8 4745.1 4922.1 4928.5 5111.1 4875.6 4930.1 5013.1 5063.3 5071.2 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | [#4] prototype.html Cycles:180 Average:4511.77 Median:4992.80 stddev:1389.55 (27.8%) stddev-sans-first:1356.93 04:10:14 INFO - PROCESS | 1680 | Values: 295.3 327.1 349.7 361.6 367.1 4223.5 5047.5 5125.7 5342.0 5431.6 4927.6 4957.4 4987.9 5066.4 5282.9 3594.6 4055.7 4060.7 4073.6 4092.0 3893.6 3954.6 4021.7 4079.3 4097.5 3873.5 4033.6 4043.7 4045.2 4054.9 3604.8 3691.3 3998.4 4044.8 4061.2 3155.6 3336.5 3406.9 3443.8 3530.7 4369.0 4749.8 5104.5 5133.9 5135.3 4621.6 4632.9 4651.6 4652.3 4664.6 5221.9 5427.0 5430.6 5515.4 5556.2 3819.9 3825.3 3836.6 3843.5 3853.6 5063.1 5897.8 5910.0 5911.2 5918.4 3317.9 3742.5 3923.6 3926.7 3939.0 3518.2 3767.0 3940.4 3968.8 3977.9 3875.4 4491.6 4518.9 4595.9 4607.5 5016.8 5682.0 5687.7 5694.8 5709.1 1252.9 1255.4 1267.5 1287.9 1295.8 855.7 865.4 867.2 874.1 887.9 4532.3 4747.6 4782.4 5001.9 5057.0 4588.0 4997.8 5365.8 5610.6 5644.4 4638.5 4718.9 4954.9 5089.4 5147.3 2675.3 2900.9 2917.2 2934.0 2957.3 5267.8 5392.6 5527.3 5819.5 5895.5 4893.9 5489.5 5731.8 5937.0 5939.1 5457.3 5975.0 5978.9 5979.8 6063.0 5084.8 5380.1 5794.1 5795.1 5800.9 4916.6 5270.8 5706.9 5709.5 5710.0 6013.8 6030.8 6032.0 6032.1 6070.8 3684.3 3866.5 3889.6 3908.9 3911.0 5530.8 5743.7 5759.6 5764.3 5818.2 4770.8 5559.9 5633.9 5650.6 5687.4 5591.9 5596.3 5602.3 5615.9 5628.8 4788.3 5197.0 5470.0 5506.4 5546.9 4680.3 5421.9 5609.0 5656.0 5774.9 4629.8 4881.9 4965.2 5554.3 5565.6 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - PROCESS | 1680 | [#5] yui.html Cycles:180 Average:20354.90 Median:4062.10 stddev:29351.19 (722.6%) stddev-sans-first:29396.40 04:10:14 INFO - PROCESS | 1680 | Values: 694.4 718.3 742.0 755.4 837.8 14404.0 15285.0 15288.2 15309.3 15323.0 14027.6 14095.9 14121.4 14147.0 14161.4 842.1 854.6 856.5 856.6 858.0 676.0 696.5 853.2 855.0 855.8 727.1 786.2 862.6 885.8 894.5 898.6 900.6 901.9 902.1 903.1 670.5 671.1 671.7 671.9 672.6 11665.2 12140.6 14104.2 14611.8 14656.3 13999.9 14002.6 14080.1 14141.3 14210.4 11020.9 11028.4 11129.3 11437.3 11828.8 3600.8 3765.2 3810.8 3882.4 3883.2 84826.0 92560.2 100454.5 102417.0 102817.9 10644.9 10866.2 11072.8 11095.2 11664.2 22050.2 22074.8 22264.4 22427.7 22449.3 7352.7 7450.3 7510.0 7578.3 7668.0 4056.9 4067.3 4171.5 4192.2 4198.5 3512.2 3631.6 3632.0 3634.6 3634.8 522.9 645.9 647.5 648.6 657.0 629.3 658.2 682.8 686.2 688.0 9739.1 9909.9 10076.0 10155.4 10204.9 646.8 651.1 665.6 679.7 687.3 4496.6 4907.3 4916.4 4940.3 4963.6 101472.0 105970.5 107424.0 107534.5 108484.0 89286.0 92110.2 92212.5 92418.0 93626.5 80115.0 80658.6 82349.0 83078.2 83235.6 9314.6 9636.4 9645.4 9656.3 9762.8 37655.9 46125.8 54110.7 54770.0 55361.0 63226.0 66041.0 66492.3 68202.3 68222.7 12776.9 12842.4 12849.4 13196.9 13277.0 14244.9 14249.4 14267.1 14745.5 14900.8 13189.9 13447.3 13512.4 13610.0 13756.4 12731.6 12788.9 13450.6 13595.2 13962.7 12835.9 12965.2 13010.4 13086.5 13090.1 9451.9 10748.6 11147.3 11149.4 11229.2 9527.6 10436.3 10647.6 10869.1 10875.9 04:10:14 INFO - PROCESS | 1680 | -------- Summary: end -------- 04:10:14 INFO - PROCESS | 1680 | 04:10:14 INFO - TEST-INFO | 1680: exit 0 04:10:14 INFO - TEST-OK | dromaeo_css | took 1117923ms 04:10:14 INFO - TEST-START | kraken 04:10:14 INFO - operating with platform_type : mac_ 04:10:14 INFO - Initialising browser for kraken test... 04:10:14 INFO - TEST-INFO | started process 1689 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/tmpVRN5rd/profile http://localhost:49255/getInfo.html) 04:10:17 INFO - PROCESS | 1689 | __metrics Screen width/height:1600/1200 04:10:17 INFO - PROCESS | 1689 | colorDepth:24 04:10:17 INFO - PROCESS | 1689 | Browser inner width/height: 1024/689 04:10:17 INFO - PROCESS | 1689 | __metrics 04:10:17 INFO - PROCESS | 1689 | 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" 04:10:17 INFO - PROCESS | 1689 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:10:17 INFO - TEST-INFO | 1689: exit 0 04:10:17 INFO - Browser initialized. 04:10:17 INFO - Running cycle 1/1 for kraken test... 04:10:17 INFO - TEST-INFO | started process 1691 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/tmpVRN5rd/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:10:30 INFO - PROCESS | 1691 | RSS: Main: 212946944 04:10:30 INFO - PROCESS | 1691 | 04:10:32 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49255/tests/kraken/driver.html?testName=audio-beat-detection) 04:10:33 INFO - PROCESS | 1691 | RSS: Main: 266452992 04:10:33 INFO - PROCESS | 1691 | 04:10:36 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49255/tests/kraken/driver.html?testName=audio-dft) 04:10:36 INFO - PROCESS | 1691 | RSS: Main: 276615168 04:10:36 INFO - PROCESS | 1691 | 04:10:39 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49255/tests/kraken/driver.html?testName=audio-fft) 04:10:40 INFO - PROCESS | 1691 | RSS: Main: 373481472 04:10:40 INFO - PROCESS | 1691 | 04:10:42 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49255/tests/kraken/driver.html?testName=audio-oscillator) 04:10:43 INFO - PROCESS | 1691 | RSS: Main: 276275200 04:10:43 INFO - PROCESS | 1691 | 04:10:45 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49255/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:10:45 INFO - PROCESS | 1691 | RSS: Main: 277499904 04:10:45 INFO - PROCESS | 1691 | 04:10:48 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49255/tests/kraken/driver.html?testName=imaging-darkroom) 04:10:49 INFO - PROCESS | 1691 | RSS: Main: 318914560 04:10:49 INFO - PROCESS | 1691 | 04:10:52 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49255/tests/kraken/driver.html?testName=imaging-desaturate) 04:10:52 INFO - PROCESS | 1691 | RSS: Main: 318984192 04:10:52 INFO - PROCESS | 1691 | 04:10:55 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49255/tests/kraken/driver.html?testName=json-parse-financial) 04:10:56 INFO - PROCESS | 1691 | RSS: Main: 316747776 04:10:56 INFO - PROCESS | 1691 | 04:10:58 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49255/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:10:58 INFO - PROCESS | 1691 | RSS: Main: 293552128 04:10:58 INFO - PROCESS | 1691 | 04:11:00 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49255/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:11:01 INFO - PROCESS | 1691 | RSS: Main: 299495424 04:11:01 INFO - PROCESS | 1691 | 04:11:03 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49255/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:11:04 INFO - PROCESS | 1691 | RSS: Main: 301076480 04:11:04 INFO - PROCESS | 1691 | 04:11:06 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49255/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:11:07 INFO - PROCESS | 1691 | RSS: Main: 315273216 04:11:07 INFO - PROCESS | 1691 | 04:11:10 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49255/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:11:11 INFO - PROCESS | 1691 | RSS: Main: 309260288 04:11:11 INFO - PROCESS | 1691 | 04:11:12 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49255/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49255/tests/kraken/driver.html?testName=ai-astar) 04:11:13 INFO - PROCESS | 1691 | RSS: Main: 353497088 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | __start_tp_report 04:11:13 INFO - PROCESS | 1691 | _x_x_mozilla_page_load 04:11:13 INFO - PROCESS | 1691 | _x_x_mozilla_page_load_details 04:11:13 INFO - PROCESS | 1691 | |i|pagename|runs| 04:11:13 INFO - PROCESS | 1691 | |0;ai-astar;115;114;114;114;114;115;114;113;115;114 04:11:13 INFO - PROCESS | 1691 | |1;audio-beat-detection;142;92;107;165;129;99;128;125;150;107 04:11:13 INFO - PROCESS | 1691 | |2;audio-dft;187;182;186;187;186;187;184;185;184;187 04:11:13 INFO - PROCESS | 1691 | |3;audio-fft;83;60;58;89;60;59;57;57;91;74 04:11:13 INFO - PROCESS | 1691 | |4;audio-oscillator;88;71;87;69;68;69;81;67;69;82 04:11:13 INFO - PROCESS | 1691 | |5;imaging-gaussian-blur;90;87;90;86;90;87;90;87;89;86 04:11:13 INFO - PROCESS | 1691 | |6;imaging-darkroom;100;101;114;145;99;100;100;100;99;100 04:11:13 INFO - PROCESS | 1691 | |7;imaging-desaturate;86;88;89;92;88;88;86;86;89;85 04:11:13 INFO - PROCESS | 1691 | |8;json-parse-financial;59;54;55;56;57;54;52;79;78;78 04:11:13 INFO - PROCESS | 1691 | |9;json-stringify-tinderbox;64;70;75;76;71;69;70;70;70;70 04:11:13 INFO - PROCESS | 1691 | |10;stanford-crypto-aes;85;85;86;83;81;87;95;96;92;81 04:11:13 INFO - PROCESS | 1691 | |11;stanford-crypto-ccm;135;138;150;137;134;137;139;142;182;147 04:11:13 INFO - PROCESS | 1691 | |12;stanford-crypto-pbkdf2;167;169;169;165;169;166;166;164;204;162 04:11:13 INFO - PROCESS | 1691 | |13;stanford-crypto-sha256-iterative;65;67;68;65;65;63;65;66;65;65 04:11:13 INFO - PROCESS | 1691 | __end_tp_report 04:11:13 INFO - PROCESS | 1691 | __start_cc_report 04:11:13 INFO - PROCESS | 1691 | _x_x_mozilla_cycle_collect,2216 04:11:13 INFO - PROCESS | 1691 | __end_cc_report 04:11:13 INFO - PROCESS | 1691 | __startTimestamp1488024673207__endTimestamp 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | ------- Summary: start ------- 04:11:13 INFO - PROCESS | 1691 | Number of tests: 14 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#0] ai-astar Cycles:10 Average:114.20 Median:114.00 stddev:0.63 (0.6%) stddev-sans-first:0.60 04:11:13 INFO - PROCESS | 1691 | Values: 115.0 114.0 114.0 114.0 114.0 115.0 114.0 113.0 115.0 114.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#1] audio-beat-detection Cycles:10 Average:124.40 Median:146.00 stddev:23.45 (16.1%) stddev-sans-first:23.99 04:11:13 INFO - PROCESS | 1691 | Values: 142.0 92.0 107.0 165.0 129.0 99.0 128.0 125.0 150.0 107.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#2] audio-dft Cycles:10 Average:185.50 Median:186.50 stddev:1.72 (0.9%) stddev-sans-first:1.73 04:11:13 INFO - PROCESS | 1691 | Values: 187.0 182.0 186.0 187.0 186.0 187.0 184.0 185.0 184.0 187.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#3] audio-fft Cycles:10 Average:68.80 Median:67.00 stddev:14.05 (21.0%) stddev-sans-first:13.93 04:11:13 INFO - PROCESS | 1691 | Values: 83.0 60.0 58.0 89.0 60.0 59.0 57.0 57.0 91.0 74.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#4] audio-oscillator Cycles:10 Average:75.10 Median:76.00 stddev:8.40 (11.1%) stddev-sans-first:7.50 04:11:13 INFO - PROCESS | 1691 | Values: 88.0 71.0 87.0 69.0 68.0 69.0 81.0 67.0 69.0 82.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#5] imaging-gaussian-blur Cycles:10 Average:88.20 Median:89.50 stddev:1.75 (2.0%) stddev-sans-first:1.73 04:11:13 INFO - PROCESS | 1691 | Values: 90.0 87.0 90.0 86.0 90.0 87.0 90.0 87.0 89.0 86.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#6] imaging-darkroom Cycles:10 Average:105.80 Median:107.50 stddev:14.48 (13.5%) stddev-sans-first:15.21 04:11:13 INFO - PROCESS | 1691 | Values: 100.0 101.0 114.0 145.0 99.0 100.0 100.0 100.0 99.0 100.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#7] imaging-desaturate Cycles:10 Average:87.70 Median:88.00 stddev:2.06 (2.3%) stddev-sans-first:2.09 04:11:13 INFO - PROCESS | 1691 | Values: 86.0 88.0 89.0 92.0 88.0 88.0 86.0 86.0 89.0 85.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#8] json-parse-financial Cycles:10 Average:62.20 Median:58.00 stddev:11.29 (19.5%) stddev-sans-first:11.92 04:11:13 INFO - PROCESS | 1691 | Values: 59.0 54.0 55.0 56.0 57.0 54.0 52.0 79.0 78.0 78.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#9] json-stringify-tinderbox Cycles:10 Average:70.50 Median:70.00 stddev:3.27 (4.7%) stddev-sans-first:2.49 04:11:13 INFO - PROCESS | 1691 | Values: 64.0 70.0 75.0 76.0 71.0 69.0 70.0 70.0 70.0 70.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#10] stanford-crypto-aes Cycles:10 Average:87.10 Median:86.50 stddev:5.45 (6.3%) stddev-sans-first:5.72 04:11:13 INFO - PROCESS | 1691 | Values: 85.0 85.0 86.0 83.0 81.0 87.0 95.0 96.0 92.0 81.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#11] stanford-crypto-ccm Cycles:10 Average:144.10 Median:140.50 stddev:14.27 (10.2%) stddev-sans-first:14.75 04:11:13 INFO - PROCESS | 1691 | Values: 135.0 138.0 150.0 137.0 134.0 137.0 139.0 142.0 182.0 147.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:170.10 Median:168.00 stddev:12.13 (7.2%) stddev-sans-first:12.82 04:11:13 INFO - PROCESS | 1691 | Values: 167.0 169.0 169.0 165.0 169.0 166.0 166.0 164.0 204.0 162.0 04:11:13 INFO - PROCESS | 1691 | 04:11:13 INFO - PROCESS | 1691 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.40 Median:65.00 stddev:1.35 (2.1%) stddev-sans-first:1.42 04:11:13 INFO - PROCESS | 1691 | Values: 65.0 67.0 68.0 65.0 65.0 63.0 65.0 66.0 65.0 65.0 04:11:13 INFO - PROCESS | 1691 | -------- Summary: end -------- 04:11:13 INFO - PROCESS | 1691 | 04:11:14 INFO - TEST-INFO | 1691: exit 0 04:11:14 INFO - TEST-OK | kraken | took 59250ms 04:11:14 INFO - SUITE-END | took 1177s 04:11:14 INFO - Completed test suite (00:19:37) 04:11:14 INFO - javascript benchmark 04:11:14 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2832.4335132973406, 3307.570015897932, 3347.8493467793946, 3355.614104377997, 3390.898273051808, 5614.943850561498, 5626.240457538231, 5674.0, 5682.659040457575, 5700.8859822803515, 5675.290588676416, 5742.856428589287, 5758.769649214027, 5758.884822303551, 5801.303843538782, 5166.225066240066, 5166.457521960197, 5204.765785539641, 5224.085784987631, 5253.527182553569, 5118.769655365499, 5144.459831717653, 5154.896902061956, 5283.55089817364, 5341.626086173969, 5152.381714194302, 5220.112580861262, 5222.321098257221, 5226.973865130669, 5230.215467679859, 5203.895922081556, 5217.37391513019, 5232.869178270574, 5237.502437268454, 5243.475652434764, 5083.135866902636, 5176.8964620707375, 5193.610479214036, 5207.140821764404, 5237.397699264595, 5581.413951535071, 5615.410381909923, 5616.747246373923, 5637.3517045539875, 5681.545476361881, 6136.163923949498, 6147.0, 6156.3843615638525, 6195.163652906845, 6220.409061139185, 5455.754491047913, 6178.38216178383, 6251.218597675291, 6255.593386429868, 6271.090691849702, 5764.51001664859, 5817.243758311392, 5818.796342128006, 5824.825255242307, 5844.853878653068, 6139.1064578004725, 6144.341027922436, 6204.534659900435, 6226.40849119333, 6228.968855155696, 6111.297200821873, 6132.5509216291, 6135.153079307736, 6137.757446213422, 6141.915626108588, 6191.938080619136, 6254.030625253093, 6254.9687251563455, 6257.0614407838275, 6265.498760099181, 6102.176206212193, 6119.41115851624, 6201.875962480725, 6207.844803879849, 6225.533085018642, 6128.167033931239, 6136.21274067861, 6136.3965394158, 6141.201643786279, 6225.595336303217, 4978.253262010728, 4982.402111746614, 4982.729404001956, 4986.750662466862, 5011.448740638527, 4425.137098265807, 4429.025614364835, 4437.312216606431, 4452.710573812692, 4475.485319188335, 5077.339945807095, 5711.3146422428745, 5724.713764311768, 5766.567507436959, 5769.769209231584, 6194.690265486708, 6204.472619827275, 6228.937710622927, 6240.344763799826, 6248.031555108965, 5612.242347283064, 5637.9718101409235, 5649.943500565024, 5761.222234998221, 5854.970725146347, 5415.350157981067, 5456.290682211366, 5483.945160548423, 5515.172724091338, 5527.944720552823, 6136.243373036893, 6185.350538193605, 6185.783497577563, 6257.1240026395435, 6267.561270711007, 6120.782376608402, 6210.720517576629, 6229.2524897010835, 6243.625382477066, 6243.656598887105, 6248.468880145057, 6270.811875643738, 6273.905891411724, 6282.120503129474, 6288.27684816252, 6042.365551617193, 6120.296165940974, 6165.075238714228, 6180.196574445294, 6188.071789231652, 6186.597871138361, 6200.193974783249, 6219.626822390671, 6246.656433896179, 6248.968755156195, 6109.480694141048, 6110.480609148272, 6117.602355846856, 6122.908156377569, 6146.323904370605, 6048.758049678139, 6060.0305850134, 6121.959266924722, 6146.0473626587955, 6151.26184857802, 5785.074388097884, 5842.912356314574, 5852.590318677822, 5890.352061273342, 5955.583109182489, 5854.531637469077, 6037.939620603738, 6049.0926361046195, 6065.909011364744, 6067.969660151671, 5880.911786323294, 5887.52899768009, 5893.9115913260475, 5896.262967129109, 5900.380460051632], "value": 5678.117178282078, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [465.80203413549236, 478.1918557637591, 514.7117614136084, 521.4212224430879, 524.1142469227009, 27919.02283420081, 40314.59685403145, 41775.0, 41803.58196418035, 41913.37129943046, 43933.56066439335, 44039.89900252495, 44218.557814421845, 44250.778746106225, 44297.55702442975, 8334.458260213098, 9241.584128714207, 9419.29355298352, 9434.622615095388, 9444.622215111387, 8437.493750374966, 11183.720406989809, 11434.085273178167, 11439.771204575904, 11633.418329083554, 11339.37633430161, 11425.42872856358, 11427.200095993283, 11435.656930292063, 11445.542178312857, 7329.45029122818, 8650.524221167832, 11389.601363952263, 11439.485223164978, 11465.025472834819, 11060.336379817236, 11335.093192544577, 11346.546138154465, 11537.769244615061, 11575.594854180148, 41307.58692413067, 41714.957126071786, 41742.95642608929, 41823.37264941028, 41969.580304196876, 3425.74306926979, 3955.920881582352, 3980.8098406977138, 4001.4998125234347, 4115.176964607091, 28910.85544572264, 29858.70141298581, 29869.103926882228, 29889.25276868074, 30301.545476817864, 3176.126565194567, 3185.792923459968, 3237.4172648923186, 3255.12111729834, 3279.6884295991845, 479045.9999999965, 479807.0, 479962.0, 480151.9999999965, 481600.0, 60882.08676869851, 61066.69466652638, 61182.0, 61235.38764612297, 61371.38628613746, 67778.0, 67879.66060169667, 67893.0, 67901.0, 68038.31961680419, 16551.751723724155, 16767.413140540022, 16802.57993550171, 16808.74786878198, 16824.327026918785, 11566.884331156749, 11863.88136118645, 12894.742105157844, 12967.351632418342, 12974.221546707227, 15833.683326333408, 17407.73888391675, 18013.7297940531, 18042.368517101837, 18521.35175268859, 5501.312335958005, 5847.94152058474, 5994.190784244071, 6669.466442684574, 6731.932680673131, 857.1642648417867, 881.6781874615847, 887.9156480134377, 898.820235952812, 919.9724008279762, 29929.251768705955, 29981.850090749842, 30257.0, 30358.61071771674, 30374.69625303763, 1053.320608207717, 1062.102523367753, 1073.3398959639765, 1077.515118196799, 1195.8460086016862, 15687.0, 15701.371945122295, 15932.681346373007, 15954.601134971486, 15985.520434386986, 619743.0, 625220.0, 627193.0, 628258.0, 628878.0, 62685.686571566854, 62743.6862815683, 62797.68601156965, 62965.68517157385, 64048.67975660092, 1404.150488954168, 1439.7264519741216, 1460.1531111954828, 1463.2464280895347, 1470.3824393754649, 26359.472810544066, 28887.40013398804, 29280.41439171162, 29705.405891882474, 29721.0, 46566.0, 46618.533814661416, 46632.533674662816, 53183.73408132935, 53447.7327613375, 536369.0, 536693.3165334305, 537361.3131934315, 539018.0, 540722.0, 40817.59182408138, 41357.58642413537, 41655.37516937309, 41661.58338416698, 41713.1657366857, 39446.80276598714, 46567.83580410517, 46911.29633055575, 47418.0, 47917.5208247913, 30026.39947201, 37862.0, 38126.0, 38155.046123847125, 38596.68348667214, 37992.81003595075, 38393.84818455451, 39108.80445597754, 39539.40690889581, 39576.042395760196, 37720.81139594394, 38274.42588361121, 38553.2289354217, 38645.22709545737, 38658.6134138655, 30584.388312234074, 32220.355592887543, 33490.33019339551, 34527.482087769204, 34532.482012769324, 21782.0, 23445.06219751191, 23655.881720591286, 24658.566450033195, 25157.496850063264], "value": 20350.91004390001, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [325.64829983617693, 393.4236343756396, 394.7907608967247, 403.3163787380391, 424.4842516342645, 12941.676458088552, 14719.779203311959, 16446.588835279108, 20029.198832046735, 20195.697064544045, 17654.735178972325, 21387.465313367175, 21538.89230553849, 21714.89142554285, 21905.233316833914, 5746.051901436258, 5836.124581312805, 6027.126066720323, 6051.304100028509, 6074.42292982166, 5931.347551769302, 5999.040153575429, 6043.3956604339655, 6045.33501314855, 6066.09008648704, 4193.43388642534, 4401.86794396167, 6374.266959299694, 6623.834404139911, 6663.966680166593, 6452.677366131675, 6625.337466253384, 6725.899111513331, 6733.259341472434, 6734.797956061326, 5835.0, 5841.0, 5843.0, 5843.912341314884, 5848.67832269225, 25075.373115672253, 25668.486630267478, 25762.484750304888, 25810.612840807404, 25974.87012564944, 2793.0782841662203, 2810.6486689163853, 2816.478951393978, 2817.9577306340216, 2820.7179282071834, 14782.0, 15240.46658366963, 15339.386424543116, 15810.604734881605, 15938.681226375524, 1620.1575180905863, 1791.6058467137339, 1804.9639007219782, 1806.349714102922, 1815.210383483189, 121945.39027304806, 123295.15057274148, 128124.35937820344, 128670.99999999907, 132013.0, 11373.94313028446, 11467.770644587228, 11539.826902596467, 11570.537178512934, 11706.941465292619, 14475.493357732428, 14493.565193044225, 14497.202653853928, 14524.49164279245, 14543.78184327236, 8442.704505342284, 8581.184787445183, 8657.307415406753, 8669.956650216835, 8722.302215822845, 8549.273311768446, 8559.614817333235, 8563.95718021406, 8739.038705742363, 8764.0, 6136.662483563447, 6883.556337500216, 7030.824229394306, 7065.364117229474, 7083.716651333889, 1909.2458478901035, 1957.716131161002, 1959.2456904092028, 1959.931402400909, 1960.8431325493925, 857.691231156783, 902.1564836877541, 907.8002839375326, 909.6816114359921, 914.2685851319051, 20186.39440816778, 21487.57024859494, 21606.351809445743, 21699.240526581492, 21718.006461374243, 905.912904514572, 917.8531434970373, 934.63082082577, 956.5026186383042, 957.2103015012642, 10750.73123171927, 11351.602693905674, 11362.65912022624, 11405.486753096131, 11437.885621143849, 707617.0, 710965.0, 714977.0, 723838.0, 744239.0, 125778.0, 125920.0, 127915.36042319729, 128611.0, 128879.0, 997.6209040564684, 1022.1005515146624, 1037.2376303416982, 1041.2034793383068, 1043.76515284062, 18089.45731628053, 19122.235110595422, 19129.617407652047, 19234.23063077517, 19360.8063919359, 45366.77316613396, 54432.727836360566, 54589.0, 55772.88454230974, 55859.72070139623, 59586.0, 75773.62113189399, 76159.61920190364, 76798.23201768134, 79845.0, 7928.682852686059, 7997.920020799717, 8235.258826705625, 8348.916510834813, 8508.702195423379, 13045.739085218433, 13410.798838017632, 13495.865041349462, 13814.171149731048, 13843.930780346436, 11211.327320360804, 11399.373034482851, 11583.478743456733, 11760.76478470443, 11835.349055802013, 11342.546298147981, 11385.430728463378, 11575.826362604399, 11756.764864702829, 11893.405329733305, 11391.259568128045, 11465.31208127515, 11539.596114135966, 11590.0, 11625.941870290595, 7911.248431399008, 7990.961175047207, 8083.757487275391, 8510.319174465903, 8574.828503429771, 10848.891511084788, 11014.0, 11026.173037022096, 11131.220814542905, 11566.363849988331], "value": 9997.110319980788, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1309.423853504458, 1423.2812429722987, 1443.0259574787017, 1447.8769304609102, 1449.202938383889, 7966.482178658383, 8285.295749861254, 8370.414071015031, 8389.958050209756, 8397.874031889527, 7349.926500734991, 7577.545347279153, 7596.468247222697, 7884.132745398016, 8198.1801819818, 2197.165077270639, 2283.6526449394855, 2286.222684287342, 2288.233441796992, 2288.496530763238, 2261.8464583062673, 2296.402935236842, 2299.206773663092, 2301.091069027733, 2302.2057390200353, 2010.3566858605252, 2087.1338394566237, 2209.215728416413, 2248.291788086756, 2267.761885002076, 2278.7721227877246, 2291.232437133562, 2292.1633603734685, 2297.7127859017623, 2298.310506847956, 2207.249535158054, 2254.1884921428273, 2257.492064285539, 2288.6567014947723, 2293.5550603119927, 8143.063547691972, 8254.917450825475, 8270.0, 8270.37972152091, 8288.917110828876, 4910.631702622318, 5063.696178229318, 5063.746812659352, 5068.974655126738, 5073.441921388644, 2863.21261653045, 3205.983970080135, 3376.729861611065, 3440.449528075496, 3442.019024578008, 1126.5099681638515, 1167.7255844876447, 1220.6948262934266, 1226.51552636708, 1232.9568465103678, 10673.306235094695, 10693.251472396936, 10713.982171693677, 10719.517621707042, 10727.141828653688, 4072.124493233969, 4472.798724057425, 4547.47704014036, 4597.42532183477, 4670.883227919261, 9273.953630231807, 9433.386829856037, 9433.48115853621, 9438.339316247933, 9458.196053335407, 5154.458781827929, 5161.122609156452, 5163.122269214243, 5169.431362550116, 5169.4830516948, 4591.747453890068, 4603.838865639686, 4613.515580864028, 4650.18621741194, 4752.1921273383605, 3716.7026637868908, 3777.7544459610585, 3791.7156213284115, 3856.2287542491613, 3870.8838734837436, 1199.8260252263374, 1215.2743104791218, 1215.428748488209, 1219.5975328141692, 1234.666640007193, 840.7225615546855, 872.4024043530202, 882.0914458108159, 902.4675441489553, 926.7389999355128, 5319.946800532022, 5422.43064478232, 5581.804636837773, 5591.608587398924, 5645.5483561314995, 492.7659361803115, 554.3790954131399, 565.6266863869909, 588.1325045557768, 590.7725525672647, 2943.2641839540115, 3429.2798512312197, 3662.212624285791, 3679.521662183899, 3755.7746535207975, 9534.046595340411, 9929.553170107363, 9948.005199479994, 9961.203103751683, 9970.202383809277, 9480.24158067353, 9685.0, 9897.257705672104, 9952.452615106095, 9976.05227503386, 7196.136463624399, 7435.628218589157, 7680.731174408869, 7801.80495487606, 7837.608119593998, 5285.735713214401, 5421.0, 5468.972655136698, 5505.834824955257, 5507.091329930677, 7630.084389873251, 8956.820863582821, 9004.86492702623, 9098.545072746203, 9231.123043310874, 8542.530160841214, 8815.691450799191, 9099.49952752605, 9158.771030724285, 9225.861612075958, 7088.0076789248515, 7203.819904502429, 7207.8558428832175, 7210.242924492853, 7238.746643867439, 7428.071491063617, 7675.961620191863, 7725.1502334744255, 7744.303012728656, 7872.803179920548, 6823.4882383822405, 7056.611886346095, 7113.502054856111, 7129.607871566906, 7169.892451613335, 6191.9690401547705, 6957.1651401832105, 7006.614636195059, 7086.539374940612, 7114.928850711427, 6144.600600960924, 6148.3236843948025, 6159.384061593805, 6179.969100154471, 6199.845003874939, 4727.834525791718, 4745.145873742759, 4922.145155809693, 4928.531789479994, 5111.080005598879, 4875.609951203966, 4930.112579735682, 5013.072581572421, 5063.265826455217, 5071.163258062378], "value": 4274.915746824575, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [295.3207622468323, 327.12983463985773, 349.6789006249068, 361.6166863125087, 367.1408903166591, 4223.493180818298, 5047.495250474951, 5125.666831655944, 5341.973290133554, 5431.565474762019, 4927.605791536677, 4957.380327459067, 4987.852793857415, 5066.392032956051, 5282.920756188661, 3594.5506811648543, 4055.655269302113, 4060.654844338235, 4073.6130067643526, 4091.977005748563, 3893.552241492222, 3954.604539546051, 4021.698372622065, 4079.3473044312914, 4097.504410890018, 3873.496445462086, 4033.5764744701823, 4043.737157084795, 4045.2314060328445, 4054.9391759123637, 3604.7656902301264, 3691.335559599271, 3998.3602623580086, 4044.757314561136, 4061.2283666103344, 3155.5897733294523, 3336.4828451590042, 3406.914827129317, 3443.7933723976644, 3530.6583498270747, 4369.0023628379995, 4749.810007599692, 5104.540591346797, 5133.947540754137, 5135.255387968761, 4621.607163391116, 4632.86101416958, 4651.558101980307, 4652.278896771006, 4664.55686709762, 5221.869453263699, 5426.996005738951, 5430.551599734158, 5515.365732940683, 5556.194236873032, 3819.949513883704, 3825.3305671507374, 3836.5971572984713, 3843.500344955166, 3853.5761066282685, 5063.139266324733, 5897.7935772247765, 5909.995300798874, 5911.231539899829, 5918.437748413937, 3317.8838740644446, 3742.476053352478, 3923.6272554107313, 3926.7447615904875, 3938.9803050985133, 3518.1732292911147, 3766.9640848766808, 3940.4286378474962, 3968.8214030368704, 3977.940330895039, 3875.379939209713, 4491.640668746492, 4518.864434066983, 4595.885102872455, 4607.521321402387, 5016.799328026838, 5682.0, 5687.744051517609, 5694.829155125353, 5709.115087161496, 1252.906032047582, 1255.3911352993791, 1267.480333063458, 1287.922724636525, 1295.7602843473987, 855.7347222361088, 865.385576240876, 867.2395038072723, 874.0734821089666, 887.9067697891628, 4532.297493888453, 4747.620190384761, 4782.402199725035, 5001.874953126128, 5057.039162559102, 4588.0, 4997.750112494361, 5365.758540865592, 5610.607257492018, 5644.379118296984, 4638.536146385334, 4718.867471806741, 4954.860382112134, 5089.440161582223, 5147.279380886679, 2675.331167208198, 2900.883964641433, 2917.2140605721484, 2934.0, 2957.33459971509, 5267.841964741064, 5392.568594512508, 5527.346873500742, 5819.5053420459735, 5895.469407753237, 4893.926591101136, 5489.505944465017, 5731.828045158652, 5937.033281552099, 5939.07944268639, 5457.263269458731, 5974.954382983047, 5978.850528736816, 5979.760809567656, 6062.969685151546, 5084.779652883355, 5380.067863014745, 5794.131904707028, 5795.1017592273265, 5800.940666063487, 4916.557509824133, 5270.8155214567305, 5706.857328566819, 5709.4861462466915, 5709.974468000133, 6013.819585412444, 6030.788922387871, 6031.969840150947, 6032.065029920369, 6070.7875224366935, 3684.299983003221, 3866.4780254666384, 3889.611038896201, 3908.902277443087, 3910.96089039106, 5530.806421775219, 5743.655380677173, 5759.596828221985, 5764.279465066867, 5818.24362832846, 4770.761461926959, 5559.8888022240135, 5633.887322253614, 5650.604457688087, 5687.364797689869, 5591.944080559142, 5596.3284405871555, 5602.2717046783655, 5615.915761263666, 5628.802991895264, 4788.329633851334, 5196.9740151299, 5469.972650136724, 5506.394296627448, 5546.889062218653, 4680.251159814414, 5421.891562168814, 5608.990381731328, 5656.0, 5774.94225057744, 4629.814807407801, 4881.925181797651, 4965.219477092695, 5554.333479982428, 5565.5825813063375], "value": 4076.0706587321647, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [694.3646563394494, 718.2888939949448, 741.9814504637384, 755.3994574313421, 837.7779888329592, 14404.0, 15285.006474579159, 15288.159151246677, 15309.311081001353, 15323.004004739683, 14027.649308767286, 14095.929520352383, 14121.364538595762, 14147.0, 14161.362738676758, 842.1241908415241, 854.5855260198798, 856.4989481153533, 856.5674334461088, 857.9957100214522, 676.0231465532307, 696.5437638346865, 853.2193043365313, 854.9871751923727, 855.7946092937713, 727.0983979864982, 786.2059320086724, 862.560094351882, 885.7953183670203, 894.4901406198469, 898.6225785170211, 900.6037343568809, 901.8827552418144, 902.0798785239052, 903.1420150856646, 670.5473805181483, 671.0906721392491, 671.711164199394, 671.8790617688815, 672.5561129654453, 11665.24175928562, 12140.635780926586, 14104.153750774987, 14611.78082328766, 14656.267186640733, 13999.930000350036, 14002.649933751738, 14080.084794488326, 14141.29293535319, 14210.431582736677, 11020.889791102067, 11028.44857757109, 11129.276597021168, 11437.256578322465, 11828.763424731456, 3600.837962291703, 3765.1904840459433, 3810.771353718758, 3882.437046628223, 3883.165119499321, 84826.0, 92560.24171598344, 100454.4977275109, 102417.0, 102817.94364112751, 10644.94677526623, 10866.185036122322, 11072.833907491395, 11095.223334366518, 11664.241824281395, 22050.228242011453, 22074.779252207594, 22264.443388915406, 22427.663585046237, 22449.32652020442, 7352.705891764376, 7450.2549745026145, 7509.962450187714, 7578.317951384402, 7667.961660191663, 4056.858009969637, 4067.349224124126, 4171.541130475645, 4192.224438478891, 4198.538160802309, 3512.1921957949817, 3631.618680038611, 3632.0, 3634.636536346397, 3634.818259087035, 522.9450907654641, 645.8772833161685, 647.4787795824312, 648.6075924065872, 657.0472814419112, 629.2920464477463, 658.2298710508717, 682.8019874236516, 686.2245662401455, 687.9690413931385, 9739.123478886793, 9909.900900990899, 10076.0, 10155.390676559282, 10204.897951020543, 646.7606985415426, 651.1307404614893, 665.5723026414007, 679.7247114918466, 687.2646268492665, 4496.595306422372, 4907.312976183337, 4916.385451818523, 4940.283658869515, 4963.627727920348, 101472.0, 105970.47014765031, 107424.0, 107534.46232768786, 108484.0, 89285.9999999987, 92110.15779684369, 92212.53893730488, 92418.0, 93626.53186734159, 80115.0, 80658.59670701608, 82349.0, 83078.16921830825, 83235.5838220805, 9314.612397884684, 9636.357295522585, 9645.357694006174, 9656.282445516137, 9762.755931101496, 37655.870323890325, 46125.769371154274, 54110.72944635252, 54770.0, 55361.0, 63226.0, 66041.0, 66492.33507664861, 68202.3179768196, 68222.65888670525, 12776.936115319364, 12842.357882106044, 12849.35753212317, 13196.868031319947, 13277.0, 14244.928775356057, 14249.38416890239, 14267.07264027835, 14745.523839771362, 14900.776488352467, 13189.934050329686, 13447.327633618084, 13512.391942362421, 13610.0, 13756.449742010207, 12731.61805145847, 12788.936055319664, 13450.596482105553, 13595.184288942695, 13962.650933726738, 12835.93582032084, 12965.22208667483, 13010.414531345923, 13086.541971030969, 13090.083694141318, 9451.87871782877, 10748.570057197625, 11147.331160130418, 11149.386783726974, 11229.21395502307, 9527.57125929321, 10436.321639093434, 10647.574097036031, 10869.130469562575, 10875.945620271848], "value": 7403.238657504026, "unit": "score"}], "name": "dromaeo_css", "value": 7281.440625070584, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 114.0, 114.0, 114.0, 114.0, 115.0, 114.0, 113.0, 115.0, 114.0], "value": 114.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 92.0, 107.0, 165.0, 129.0, 99.0, 128.0, 125.0, 150.0, 107.0], "value": 124.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [187.0, 182.0, 186.0, 187.0, 186.0, 187.0, 184.0, 185.0, 184.0, 187.0], "value": 185.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 60.0, 58.0, 89.0, 60.0, 59.0, 57.0, 57.0, 91.0, 74.0], "value": 68.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 71.0, 87.0, 69.0, 68.0, 69.0, 81.0, 67.0, 69.0, 82.0], "value": 75.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 87.0, 90.0, 86.0, 90.0, 87.0, 90.0, 87.0, 89.0, 86.0], "value": 88.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 101.0, 114.0, 145.0, 99.0, 100.0, 100.0, 100.0, 99.0, 100.0], "value": 105.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 88.0, 89.0, 92.0, 88.0, 88.0, 86.0, 86.0, 89.0, 85.0], "value": 87.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 54.0, 55.0, 56.0, 57.0, 54.0, 52.0, 79.0, 78.0, 78.0], "value": 62.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 70.0, 75.0, 76.0, 71.0, 69.0, 70.0, 70.0, 70.0, 70.0], "value": 70.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 86.0, 83.0, 81.0, 87.0, 95.0, 96.0, 92.0, 81.0], "value": 87.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [135.0, 138.0, 150.0, 137.0, 134.0, 137.0, 139.0, 142.0, 182.0, 147.0], "value": 144.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 169.0, 169.0, 165.0, 169.0, 166.0, 166.0, 164.0, 204.0, 162.0], "value": 170.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 67.0, 68.0, 65.0, 65.0, 63.0, 65.0, 66.0, 65.0, 65.0], "value": 65.4, "unit": "score"}], "name": "kraken", "value": 1449.1, "alertThreshold": 2.0}]} 04:11:14 INFO - Return code: 0 04:11:14 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:11:14 ERROR - # TBPL SUCCESS # 04:11:14 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 04:11:14 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 04:11:14 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 04:11:14 INFO - 2017-02-25 04:11:14.498 screenresolution[1695:17002] starting screenresolution argv=screenresolution get 04:11:14 INFO - 2017-02-25 04:11:14.502 screenresolution[1695:17002] Display 0: 1600x1200x32@60 04:11:14 INFO - 2017-02-25 04:11:14.508 screenresolution[1696:17005] starting screenresolution argv=screenresolution list 04:11:14 INFO - Available Modes on Display 0 04:11:14 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 04:11:14 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 04:11:14 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 04:11:14 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 04:11:14 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 04:11:14 INFO - Intel Iris: 04:11:14 INFO - Chipset Model: Intel Iris 04:11:14 INFO - Type: GPU 04:11:14 INFO - Bus: Built-In 04:11:14 INFO - VRAM (Dynamic, Max): 1536 MB 04:11:14 INFO - Vendor: Intel (0x8086) 04:11:14 INFO - Device ID: 0x0a2e 04:11:14 INFO - Revision ID: 0x0009 04:11:14 INFO - Displays: 04:11:14 INFO - Display: 04:11:14 INFO - Resolution: 1600 x 1200 @ 60 Hz 04:11:14 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 04:11:14 INFO - Display Serial Number: 1600x1200 60 04:11:14 INFO - Main Display: Yes 04:11:14 INFO - Mirror: Off 04:11:14 INFO - Online: Yes 04:11:14 INFO - Rotation: Supported 04:11:14 INFO - Return code: 0 04:11:14 INFO - Running post-action listener: _resource_record_post_action 04:11:14 INFO - [mozharness: 2017-02-25 12:11:14.753059Z] Finished run-tests step (success) 04:11:14 INFO - Running post-run listener: _resource_record_post_run 04:11:14 INFO - Total resource usage - Wall time: 1198s; CPU: 54.0%; Read bytes: 33713152; Write bytes: 510390272; Read time: 314; Write time: 1654 04:11:14 INFO - TinderboxPrint: CPU usage
53.9% 04:11:14 INFO - TinderboxPrint: I/O read bytes / time
33,713,152 / 314 04:11:14 INFO - TinderboxPrint: I/O write bytes / time
510,390,272 / 1,654 04:11:14 INFO - TinderboxPrint: CPU idle
2,210.9 (46.1%) 04:11:14 INFO - TinderboxPrint: CPU system
957.9 (20.0%) 04:11:14 INFO - TinderboxPrint: CPU user
1,624.9 (33.9%) 04:11:14 INFO - TinderboxPrint: Swap in / out
236,904,448 / 0 04:11:14 INFO - install - Wall time: 21s; CPU: 55.0%; Read bytes: 203477504; Write bytes: 200816640; Read time: 15693; Write time: 454 04:11:14 INFO - run-tests - Wall time: 1178s; CPU: 54.0%; Read bytes: 31738880; Write bytes: 298883072; Read time: 288; Write time: 1167 04:11:15 INFO - Running post-run listener: _upload_blobber_files 04:11:15 INFO - Blob upload gear active. 04:11:15 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:11:15 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 04:11:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:11:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:11:15 INFO - (blobuploader) - INFO - Open directory for files ... 04:11:15 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 04:11:15 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:11:15 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:11:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 04:11:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:11:17 INFO - (blobuploader) - INFO - Done attempting. 04:11:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 04:11:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:11:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:11:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 04:11:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:11:18 INFO - (blobuploader) - INFO - Done attempting. 04:11:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 04:11:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:11:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:11:19 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 04:11:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:11:19 INFO - (blobuploader) - INFO - Done attempting. 04:11:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:11:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:11:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:11:21 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:11:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:11:21 INFO - (blobuploader) - INFO - Done attempting. 04:11:21 INFO - (blobuploader) - INFO - Iteration through files over. 04:11:21 INFO - Return code: 0 04:11:21 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:11:21 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:11:21 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f2309912d4f511331a2dafd86b89657cb6f1c3bf184272dbb7331ecd986350d00ba18695fa6b2ddd9e4046f225de6270842e180e5182ffddf7fe182b84be2058", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/106f20ab799b7a2389dcc2c97ff547db0dba81a40195f386eb28719ca99ff1b3b495a9cedd360fb921e9d1372fa6a9a8c26604fdea685f8e802697a242781f3d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/80e0c0f7f820eaebf6b7434a2a003bffa04e79fe5b7bd7c785d7f9b232ee171f6dad470b9ba4840e4261a7d17cec107694dc1897085c7f2b0aa8e7487d8ed79b", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/91d956e5d365a3cff28b2a3f38d31b2c03f4d282359ab614ab50b97083f78eaa8bc391863f83371fd88d84920647d736c95d9f1de4c6a7c112b723b2d35a5ea3"} 04:11:21 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:11:21 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:11:21 INFO - Contents: 04:11:21 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f2309912d4f511331a2dafd86b89657cb6f1c3bf184272dbb7331ecd986350d00ba18695fa6b2ddd9e4046f225de6270842e180e5182ffddf7fe182b84be2058", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/106f20ab799b7a2389dcc2c97ff547db0dba81a40195f386eb28719ca99ff1b3b495a9cedd360fb921e9d1372fa6a9a8c26604fdea685f8e802697a242781f3d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/80e0c0f7f820eaebf6b7434a2a003bffa04e79fe5b7bd7c785d7f9b232ee171f6dad470b9ba4840e4261a7d17cec107694dc1897085c7f2b0aa8e7487d8ed79b", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/91d956e5d365a3cff28b2a3f38d31b2c03f4d282359ab614ab50b97083f78eaa8bc391863f83371fd88d84920647d736c95d9f1de4c6a7c112b723b2d35a5ea3"} 04:11:21 INFO - Running post-run listener: copy_logs_to_upload_dir 04:11:21 INFO - Copying logs to upload dir... 04:11:21 INFO - mkdir: /builds/slave/test/build/upload/logs 04:11:21 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1261.623015 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2017-02-25 04:11:21.420369) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-25 04:11:21.424122) ========= 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.6ssLNwRHAC/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.w2R71mCuVc/Listeners TMPDIR=/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f2309912d4f511331a2dafd86b89657cb6f1c3bf184272dbb7331ecd986350d00ba18695fa6b2ddd9e4046f225de6270842e180e5182ffddf7fe182b84be2058", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/106f20ab799b7a2389dcc2c97ff547db0dba81a40195f386eb28719ca99ff1b3b495a9cedd360fb921e9d1372fa6a9a8c26604fdea685f8e802697a242781f3d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/80e0c0f7f820eaebf6b7434a2a003bffa04e79fe5b7bd7c785d7f9b232ee171f6dad470b9ba4840e4261a7d17cec107694dc1897085c7f2b0aa8e7487d8ed79b", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/91d956e5d365a3cff28b2a3f38d31b2c03f4d282359ab614ab50b97083f78eaa8bc391863f83371fd88d84920647d736c95d9f1de4c6a7c112b723b2d35a5ea3"} build_url:https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011000 build_url: 'https://queue.taskcluster.net/v1/task/Og5Sun9ZQnyCOYgJSXLPxg/artifacts/public/build/firefox-53.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/f2309912d4f511331a2dafd86b89657cb6f1c3bf184272dbb7331ecd986350d00ba18695fa6b2ddd9e4046f225de6270842e180e5182ffddf7fe182b84be2058", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/106f20ab799b7a2389dcc2c97ff547db0dba81a40195f386eb28719ca99ff1b3b495a9cedd360fb921e9d1372fa6a9a8c26604fdea685f8e802697a242781f3d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/80e0c0f7f820eaebf6b7434a2a003bffa04e79fe5b7bd7c785d7f9b232ee171f6dad470b9ba4840e4261a7d17cec107694dc1897085c7f2b0aa8e7487d8ed79b", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/91d956e5d365a3cff28b2a3f38d31b2c03f4d282359ab614ab50b97083f78eaa8bc391863f83371fd88d84920647d736c95d9f1de4c6a7c112b723b2d35a5ea3"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-25 04:11:21.459151) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-25 04:11:21.459506) ========= 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.6ssLNwRHAC/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.w2R71mCuVc/Listeners TMPDIR=/var/folders/9j/4fh549jj3szc5hrvft_030_w00000w/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.005198 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-25 04:11:21.508366) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-25 04:11:21.508746) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-25 04:11:21.509189) ========= ========= Total master_lag: 0.18 =========