builder: mozilla-aurora_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0303 starttime: 1478517627.38 results: success (0) buildid: 20161107004002 builduid: 0af2c263a59f4b849a799d2d7db0b331 revision: 8027a7b723c9db7254bdb0bea3bc8937220daa7e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:27.381356) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:27.381794) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:27.382081) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:27.406460) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:27.406731) ========= 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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners TMPDIR=/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-11-07 03:20:27-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 26.0M=0s 2016-11-07 03:20:27 (26.0 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.083763 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:27.512354) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:27.512660) ========= 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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners TMPDIR=/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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.025824 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:27.560894) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-07 03:20:27.561318) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 8027a7b723c9db7254bdb0bea3bc8937220daa7e --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 8027a7b723c9db7254bdb0bea3bc8937220daa7e --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.lvtgSAxOQd/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.MDyoMqXCnU/Listeners TMPDIR=/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-11-07 03:20:27,646 truncating revision to first 12 chars 2016-11-07 03:20:27,646 Setting DEBUG logging. 2016-11-07 03:20:27,646 attempt 1/10 2016-11-07 03:20:27,646 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/8027a7b723c9?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-11-07 03:20:28,658 unpacking tar archive at: mozilla-aurora-8027a7b723c9/testing/mozharness/ program finished with exit code 0 elapsedTime=1.292382 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-07 03:20:28.876220) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:28.876545) ========= script_repo_revision: 8027a7b723c9db7254bdb0bea3bc8937220daa7e ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:28.876932) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:28.877198) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-07 03:20:28.896366) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-11-07 03:20:28.896633) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners TMPDIR=/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:20:29 INFO - MultiFileLogger online at 20161107 03:20:29 in /builds/slave/test 03:20:29 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --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:20:29 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:20:29 INFO - {'append_to_log': False, 03:20:29 INFO - 'base_work_dir': '/builds/slave/test', 03:20:29 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 03:20:29 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:20:29 INFO - 'branch': 'Mozilla-Aurora', 03:20:29 INFO - 'buildbot_json_path': 'buildprops.json', 03:20:29 INFO - 'config_files': ('talos/mac_config.py',), 03:20:29 INFO - 'default_actions': ('clobber', 03:20:29 INFO - 'read-buildbot-config', 03:20:29 INFO - 'download-and-extract', 03:20:29 INFO - 'populate-webroot', 03:20:29 INFO - 'create-virtualenv', 03:20:29 INFO - 'install', 03:20:29 INFO - 'run-tests'), 03:20:29 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:20:29 INFO - 'download_minidump_stackwalk': True, 03:20:29 INFO - 'download_symbols': 'ondemand', 03:20:29 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:20:29 INFO - 'tooltool.py': '/tools/tooltool.py', 03:20:29 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:20:29 INFO - '/tools/misc-python/virtualenv.py')}, 03:20:29 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:20:29 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:20:29 INFO - 'installer_path': 'installer.exe', 03:20:29 INFO - 'log_level': 'info', 03:20:29 INFO - 'log_name': 'talos', 03:20:29 INFO - 'log_to_console': True, 03:20:29 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 03:20:29 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 03:20:29 INFO - 'opt_config_files': (), 03:20:29 INFO - 'pip_index': False, 03:20:29 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 03:20:29 INFO - 'cmd': ('bash', 03:20:29 INFO - '-c', 03:20:29 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 03:20:29 INFO - 'enabled': True, 03:20:29 INFO - 'halt_on_failure': False, 03:20:29 INFO - 'name': 'check_screen_resolution'},), 03:20:29 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 03:20:29 INFO - 'cmd': ('bash', 03:20:29 INFO - '-c', 03:20:29 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 03:20:29 INFO - 'enabled': True, 03:20:29 INFO - 'halt_on_failure': False, 03:20:29 INFO - 'name': 'check_screen_resolution'},), 03:20:29 INFO - 'run_cmd_checks_enabled': True, 03:20:29 INFO - 'sps_profile': False, 03:20:29 INFO - 'sps_profile_interval': 0, 03:20:29 INFO - 'suite': 'dromaeojs-e10s', 03:20:29 INFO - 'system_bits': '32', 03:20:29 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:20:29 INFO - 'title': 't-yosemite-r7-0303', 03:20:29 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:20:29 INFO - 'use_talos_json': True, 03:20:29 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:20:29 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:20:29 INFO - 'work_dir': 'build'} 03:20:29 INFO - [mozharness: 2016-11-07 11:20:29.110591Z] Running clobber step. 03:20:29 INFO - Running pre-action listener: _resource_record_pre_action 03:20:29 INFO - Running main action method: clobber 03:20:29 INFO - rmtree: /builds/slave/test/build 03:20:29 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:20:31 INFO - Running post-action listener: _resource_record_post_action 03:20:31 INFO - [mozharness: 2016-11-07 11:20:31.594081Z] Finished clobber step (success) 03:20:31 INFO - [mozharness: 2016-11-07 11:20:31.594209Z] Running read-buildbot-config step. 03:20:31 INFO - Running pre-action listener: _resource_record_pre_action 03:20:31 INFO - Running main action method: read_buildbot_config 03:20:31 INFO - Using buildbot properties: 03:20:31 INFO - { 03:20:31 INFO - "project": "", 03:20:31 INFO - "product": "firefox", 03:20:31 INFO - "script_repo_revision": "production", 03:20:31 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs-e10s", 03:20:31 INFO - "repository": "", 03:20:31 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs-e10s", 03:20:31 INFO - "buildid": "20161107004002", 03:20:31 INFO - "stage_platform": "macosx64", 03:20:31 INFO - "basedir": "/builds/slave/test", 03:20:31 INFO - "nightly_build": "True", 03:20:31 INFO - "buildnumber": 442, 03:20:31 INFO - "slavename": "t-yosemite-r7-0303", 03:20:31 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 03:20:31 INFO - "platform": "yosemite_r7", 03:20:31 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 03:20:31 INFO - "branch": "mozilla-aurora", 03:20:31 INFO - "repo_path": "releases/mozilla-aurora", 03:20:31 INFO - "revision": "8027a7b723c9db7254bdb0bea3bc8937220daa7e", 03:20:31 INFO - "pgo_build": "False", 03:20:31 INFO - "builduid": "0af2c263a59f4b849a799d2d7db0b331", 03:20:31 INFO - "slavebuilddir": "test" 03:20:31 INFO - } 03:20:31 INFO - Found installer url https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg. 03:20:31 INFO - Running post-action listener: _resource_record_post_action 03:20:31 INFO - [mozharness: 2016-11-07 11:20:31.597528Z] Finished read-buildbot-config step (success) 03:20:31 INFO - [mozharness: 2016-11-07 11:20:31.597658Z] Running download-and-extract step. 03:20:31 INFO - Running pre-action listener: _resource_record_pre_action 03:20:31 INFO - Running main action method: download_and_extract 03:20:31 INFO - mkdir: /builds/slave/test/build/tests 03:20:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:20:31 INFO - trying https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json 03:20:31 INFO - Downloading https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 03:20:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json'}, attempt #1 03:20:32 INFO - Downloaded 1199 bytes. 03:20:32 INFO - Reading from file /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 03:20:32 INFO - Using the following test package requirements: 03:20:32 INFO - {u'common': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 03:20:32 INFO - u'cppunittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 03:20:32 INFO - u'firefox-51.0a2.en-US.mac.cppunittest.tests.zip'], 03:20:32 INFO - u'gtest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 03:20:32 INFO - u'firefox-51.0a2.en-US.mac.gtest.tests.zip'], 03:20:32 INFO - u'jittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 03:20:32 INFO - u'jsshell-mac.zip'], 03:20:32 INFO - u'mochitest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 03:20:32 INFO - u'firefox-51.0a2.en-US.mac.mochitest.tests.zip'], 03:20:32 INFO - u'mozbase': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 03:20:32 INFO - u'reftest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 03:20:32 INFO - u'firefox-51.0a2.en-US.mac.reftest.tests.zip'], 03:20:32 INFO - u'talos': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 03:20:32 INFO - u'firefox-51.0a2.en-US.mac.talos.tests.zip'], 03:20:32 INFO - u'web-platform': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 03:20:32 INFO - u'firefox-51.0a2.en-US.mac.web-platform.tests.zip'], 03:20:32 INFO - u'xpcshell': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 03:20:32 INFO - u'firefox-51.0a2.en-US.mac.xpcshell.tests.zip']} 03:20:32 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip'] for test suite category: common 03:20:32 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 03:20:32 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 03:20:32 INFO - Fetch https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 03:20:33 INFO - Expected file size: 16421607 03:20:40 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip', u'firefox-51.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 03:20:40 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 03:20:40 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 03:20:40 INFO - Fetch https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 03:20:40 INFO - Expected file size: 16421607 03:20:47 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip 03:20:47 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip'}, attempt #1 03:20:47 INFO - Fetch https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip into memory 03:20:47 INFO - Expected file size: 14414089 03:20:48 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:20:48 INFO - trying https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 03:20:48 INFO - Downloading https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg 03:20:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg'}, attempt #1 03:20:51 INFO - Downloaded 115534854 bytes. 03:20:51 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 03:20:51 INFO - mkdir: /builds/slave/test/properties 03:20:51 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:20:51 INFO - Writing to file /builds/slave/test/properties/build_url 03:20:51 INFO - Contents: 03:20:51 INFO - build_url:https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 03:20:52 INFO - Running post-action listener: _resource_record_post_action 03:20:52 INFO - Running post-action listener: set_extra_try_arguments 03:20:52 INFO - [mozharness: 2016-11-07 11:20:52.553263Z] Finished download-and-extract step (success) 03:20:52 INFO - [mozharness: 2016-11-07 11:20:52.553421Z] Running populate-webroot step. 03:20:52 INFO - Running pre-action listener: _resource_record_pre_action 03:20:52 INFO - Running main action method: populate_webroot 03:20:52 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:20:52 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:20:52 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:20:52 INFO - '--tppagecycles', 03:20:52 INFO - '7'], 03:20:52 INFO - 'tests': ['tsvgm']}}, 03:20:52 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:20:52 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:20:52 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:20:52 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:20:52 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:52 INFO - 'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:20:52 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:20:52 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:52 INFO - 'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['damp', 'tps']}, 03:20:52 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:52 INFO - 'tests': ['damp', 'tps']}, 03:20:52 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['dromaeo_dom']}, 03:20:52 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:20:52 INFO - 'g4': {'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['basic_compositor_video']}, 03:20:52 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 03:20:52 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['a11yr', 03:20:52 INFO - 'ts_paint', 03:20:52 INFO - 'tpaint', 03:20:52 INFO - 'sessionrestore', 03:20:52 INFO - 'sessionrestore_no_auto_restore', 03:20:52 INFO - 'tabpaint']}, 03:20:52 INFO - 'other-e10s': {'tests': ['a11yr', 03:20:52 INFO - 'ts_paint', 03:20:52 INFO - 'tpaint', 03:20:52 INFO - 'sessionrestore', 03:20:52 INFO - 'sessionrestore_no_auto_restore', 03:20:52 INFO - 'tabpaint']}, 03:20:52 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:20:52 INFO - 'ts_paint', 03:20:52 INFO - 'tpaint', 03:20:52 INFO - 'sessionrestore', 03:20:52 INFO - 'sessionrestore_no_auto_restore', 03:20:52 INFO - 'tabpaint']}, 03:20:52 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:20:52 INFO - 'ts_paint', 03:20:52 INFO - 'tpaint', 03:20:52 INFO - 'sessionrestore', 03:20:52 INFO - 'sessionrestore_no_auto_restore', 03:20:52 INFO - 'tabpaint']}, 03:20:52 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['a11yr', 03:20:52 INFO - 'ts_paint', 03:20:52 INFO - 'tpaint', 03:20:52 INFO - 'sessionrestore', 03:20:52 INFO - 'sessionrestore_no_auto_restore', 03:20:52 INFO - 'tabpaint']}, 03:20:52 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['a11yr', 03:20:52 INFO - 'ts_paint', 03:20:52 INFO - 'tpaint', 03:20:52 INFO - 'sessionrestore', 03:20:52 INFO - 'sessionrestore_no_auto_restore', 03:20:52 INFO - 'tabpaint']}, 03:20:52 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['tsvgx', 03:20:52 INFO - 'tsvgr_opacity', 03:20:52 INFO - 'tart', 03:20:52 INFO - 'tscrollx', 03:20:52 INFO - 'cart']}, 03:20:52 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:20:52 INFO - 'tsvgr_opacity', 03:20:52 INFO - 'tart', 03:20:52 INFO - 'tscrollx', 03:20:52 INFO - 'cart']}, 03:20:52 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:52 INFO - 'talos_options': ['--disable-e10s'], 03:20:52 INFO - 'tests': ['tp5o']}, 03:20:52 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:52 INFO - 'tests': ['tp5o']}, 03:20:52 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:52 INFO - 'talos_options': ['--disable-e10s', 03:20:52 INFO - '--xperf_path', 03:20:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:20:52 INFO - 'tests': ['tp5n']}, 03:20:52 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:52 INFO - 'talos_options': ['--xperf_path', 03:20:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:20:52 INFO - 'tests': ['tp5n']}}, 03:20:52 INFO - 'talos.zip': {'path': '', 03:20:52 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:20:52 INFO - Running post-action listener: _resource_record_post_action 03:20:52 INFO - [mozharness: 2016-11-07 11:20:52.571695Z] Finished populate-webroot step (success) 03:20:52 INFO - [mozharness: 2016-11-07 11:20:52.571819Z] Running create-virtualenv step. 03:20:52 INFO - Running pre-action listener: _resource_record_pre_action 03:20:52 INFO - Running main action method: create_virtualenv 03:20:52 INFO - Creating virtualenv /builds/slave/test/build/venv 03:20:52 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:20:52 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:20:52 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:20:52 INFO - Using real prefix '/tools/python27' 03:20:52 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:20:53 INFO - Installing distribute.............................................................................................................................................................................................done. 03:20:56 INFO - Installing pip.................done. 03:20:56 INFO - Return code: 0 03:20:56 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:20: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:20:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:20:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20: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:20:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:20:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:20: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', 'pip>=1.5'] in /builds/slave/test/build 03:20: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 pip>=1.5 03:20:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:20:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:20:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:20:56 INFO - 'HOME': '/Users/cltbld', 03:20:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:20:56 INFO - 'LOGNAME': 'cltbld', 03:20:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:20:56 INFO - 'MOZ_NO_REMOTE': '1', 03:20:56 INFO - 'NO_EM_RESTART': '1', 03:20:56 INFO - 'PAGER': '/bin/cat', 03:20:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:20:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:20:56 INFO - 'PWD': '/builds/slave/test', 03:20:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:20:56 INFO - 'SHELL': '/bin/bash', 03:20:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:20:56 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:20:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:20:56 INFO - 'USER': 'cltbld', 03:20:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:20:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:20:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:20:56 INFO - 'XPC_FLAGS': '0x0', 03:20:56 INFO - 'XPC_SERVICE_NAME': '0', 03:20:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:20:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:20:56 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:20:56 INFO - Cleaning up... 03:20:56 INFO - Return code: 0 03:20:56 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:20: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:20:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:20:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20: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:20:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:20:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20: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', '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 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:20: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', 'psutil>=3.1.1'] in /builds/slave/test/build 03:20: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 psutil>=3.1.1 03:20:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:20:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:20:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:20:56 INFO - 'HOME': '/Users/cltbld', 03:20:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:20:56 INFO - 'LOGNAME': 'cltbld', 03:20:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:20:56 INFO - 'MOZ_NO_REMOTE': '1', 03:20:56 INFO - 'NO_EM_RESTART': '1', 03:20:56 INFO - 'PAGER': '/bin/cat', 03:20:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:20:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:20:56 INFO - 'PWD': '/builds/slave/test', 03:20:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:20:56 INFO - 'SHELL': '/bin/bash', 03:20:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:20:56 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:20:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:20:56 INFO - 'USER': 'cltbld', 03:20:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:20:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:20:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:20:56 INFO - 'XPC_FLAGS': '0x0', 03:20:56 INFO - 'XPC_SERVICE_NAME': '0', 03:20:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:20:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:20:56 INFO - Downloading/unpacking psutil>=3.1.1 03:20: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:20: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:20: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:20: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:20: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:20: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:21:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:21:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:21:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:21:00 INFO - Installing collected packages: psutil 03:21:00 INFO - Running setup.py install for psutil 03:21:00 INFO - building 'psutil._psutil_osx' extension 03:21:00 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:21:00 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:21:00 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:21:01 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:21:01 INFO - building 'psutil._psutil_posix' extension 03:21:01 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:21:01 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 03:21:01 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 03:21:01 INFO - ^ 03:21:01 INFO - 1 warning generated. 03:21:01 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:21:01 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:21:01 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:21:01 INFO - Successfully installed psutil 03:21:01 INFO - Cleaning up... 03:21:01 INFO - Return code: 0 03:21:01 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:21:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:21:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:21:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:21:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 03:21:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 03:21:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:01 INFO - 'HOME': '/Users/cltbld', 03:21:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:01 INFO - 'LOGNAME': 'cltbld', 03:21:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:01 INFO - 'MOZ_NO_REMOTE': '1', 03:21:01 INFO - 'NO_EM_RESTART': '1', 03:21:01 INFO - 'PAGER': '/bin/cat', 03:21:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:01 INFO - 'PWD': '/builds/slave/test', 03:21:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:01 INFO - 'SHELL': '/bin/bash', 03:21:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:01 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:01 INFO - 'USER': 'cltbld', 03:21:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:01 INFO - 'XPC_FLAGS': '0x0', 03:21:01 INFO - 'XPC_SERVICE_NAME': '0', 03:21:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:01 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:21:01 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:21:01 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:21:01 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:21:01 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:21:01 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:21:01 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:21:04 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:21:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:21:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:21:04 INFO - Installing collected packages: mozsystemmonitor 03:21:04 INFO - Running setup.py install for mozsystemmonitor 03:21:04 INFO - Successfully installed mozsystemmonitor 03:21:04 INFO - Cleaning up... 03:21:04 INFO - Return code: 0 03:21:04 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:21:04 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:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:04 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:21:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:04 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 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:21:04 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:21:04 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:21:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:04 INFO - 'HOME': '/Users/cltbld', 03:21:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:04 INFO - 'LOGNAME': 'cltbld', 03:21:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:04 INFO - 'MOZ_NO_REMOTE': '1', 03:21:04 INFO - 'NO_EM_RESTART': '1', 03:21:04 INFO - 'PAGER': '/bin/cat', 03:21:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:04 INFO - 'PWD': '/builds/slave/test', 03:21:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:04 INFO - 'SHELL': '/bin/bash', 03:21:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:04 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:04 INFO - 'USER': 'cltbld', 03:21:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:04 INFO - 'XPC_FLAGS': '0x0', 03:21:04 INFO - 'XPC_SERVICE_NAME': '0', 03:21:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:04 INFO - Downloading/unpacking jsonschema==2.5.1 03:21:04 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:21:04 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:21:04 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:21:04 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:21:04 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:21:04 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:21:07 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:21:07 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:21:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:07 INFO - Downloading functools32-3.2.3-2.tar.gz 03:21:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:21:07 INFO - warning: no files found matching '*.txt' 03:21:07 INFO - no previously-included directories found matching 'build' 03:21:07 INFO - no previously-included directories found matching 'dist' 03:21:07 INFO - no previously-included directories found matching '.git*' 03:21:07 INFO - Installing collected packages: jsonschema, functools32 03:21:08 INFO - Running setup.py install for functools32 03:21:08 INFO - warning: no files found matching '*.txt' 03:21:08 INFO - no previously-included directories found matching 'build' 03:21:08 INFO - no previously-included directories found matching 'dist' 03:21:08 INFO - no previously-included directories found matching '.git*' 03:21:08 INFO - Successfully installed jsonschema functools32 03:21:08 INFO - Cleaning up... 03:21:08 INFO - Return code: 0 03:21:08 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 03:21:08 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:21:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:08 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:21:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:08 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 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:21:08 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:21:08 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:21:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:08 INFO - 'HOME': '/Users/cltbld', 03:21:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:08 INFO - 'LOGNAME': 'cltbld', 03:21:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:08 INFO - 'MOZ_NO_REMOTE': '1', 03:21:08 INFO - 'NO_EM_RESTART': '1', 03:21:08 INFO - 'PAGER': '/bin/cat', 03:21:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:08 INFO - 'PWD': '/builds/slave/test', 03:21:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:08 INFO - 'SHELL': '/bin/bash', 03:21:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:08 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:08 INFO - 'USER': 'cltbld', 03:21:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:08 INFO - 'XPC_FLAGS': '0x0', 03:21:08 INFO - 'XPC_SERVICE_NAME': '0', 03:21:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:08 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 03:21:08 INFO - Cleaning up... 03:21:08 INFO - Return code: 0 03:21:08 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:21:08 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:21:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:08 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:21:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:08 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 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:21:08 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:21:08 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:21:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:08 INFO - 'HOME': '/Users/cltbld', 03:21:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:08 INFO - 'LOGNAME': 'cltbld', 03:21:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:08 INFO - 'MOZ_NO_REMOTE': '1', 03:21:08 INFO - 'NO_EM_RESTART': '1', 03:21:08 INFO - 'PAGER': '/bin/cat', 03:21:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:08 INFO - 'PWD': '/builds/slave/test', 03:21:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:08 INFO - 'SHELL': '/bin/bash', 03:21:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:08 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:08 INFO - 'USER': 'cltbld', 03:21:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:08 INFO - 'XPC_FLAGS': '0x0', 03:21:08 INFO - 'XPC_SERVICE_NAME': '0', 03:21:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:08 INFO - Downloading/unpacking blobuploader==1.2.4 03:21:08 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:21:08 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:21:08 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:21:08 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:21:08 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:21:08 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:21:11 INFO - Downloading blobuploader-1.2.4.tar.gz 03:21:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:21:11 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:21:11 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:21:11 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:21:11 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:21:11 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:21:11 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:21:11 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:21:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:21:12 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:21: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:21: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:21: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:21: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:21: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:21: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:21:12 INFO - Downloading docopt-0.6.1.tar.gz 03:21:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:21:12 INFO - Installing collected packages: blobuploader, requests, docopt 03:21:12 INFO - Running setup.py install for blobuploader 03:21:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:21:12 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:21:12 INFO - Running setup.py install for requests 03:21:13 INFO - Running setup.py install for docopt 03:21:13 INFO - Successfully installed blobuploader requests docopt 03:21:13 INFO - Cleaning up... 03:21:13 INFO - Return code: 0 03:21:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:21:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:21:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:21:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:13 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 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:21:13 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:21:13 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:21:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:13 INFO - 'HOME': '/Users/cltbld', 03:21:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:13 INFO - 'LOGNAME': 'cltbld', 03:21:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:13 INFO - 'MOZ_NO_REMOTE': '1', 03:21:13 INFO - 'NO_EM_RESTART': '1', 03:21:13 INFO - 'PAGER': '/bin/cat', 03:21:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:13 INFO - 'PWD': '/builds/slave/test', 03:21:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:13 INFO - 'SHELL': '/bin/bash', 03:21:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:13 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:13 INFO - 'USER': 'cltbld', 03:21:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:13 INFO - 'XPC_FLAGS': '0x0', 03:21:13 INFO - 'XPC_SERVICE_NAME': '0', 03:21:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:21:13 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-mPJMxG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:21:13 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-uxwcoV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:21:13 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-PdV1On-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-qofcvA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-CIgp7C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-DboVN3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-XvujSz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-YkuM7v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-hbFo2j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-RNsR7X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-ZZWMBI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-yYin7C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:21:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:21:14 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-y2IBmS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:21:15 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-FOsqbE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:21:15 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-J_bqzY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:21:15 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-oMSKly-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:21:15 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-x7hjDy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:21:15 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:21:15 INFO - Running setup.py install for manifestparser 03:21:15 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:21:15 INFO - Running setup.py install for mozcrash 03:21:15 INFO - Running setup.py install for mozdebug 03:21:15 INFO - Running setup.py install for mozdevice 03:21:16 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Running setup.py install for mozfile 03:21:16 INFO - Running setup.py install for mozhttpd 03:21:16 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Running setup.py install for mozinfo 03:21:16 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Running setup.py install for mozInstall 03:21:16 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Running setup.py install for mozleak 03:21:16 INFO - Running setup.py install for mozlog 03:21:16 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:21:16 INFO - Running setup.py install for moznetwork 03:21:17 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:21:17 INFO - Running setup.py install for mozprocess 03:21:17 INFO - Running setup.py install for mozprofile 03:21:17 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:21:17 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:21:17 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:21:17 INFO - Running setup.py install for mozrunner 03:21:17 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:21:17 INFO - Running setup.py install for mozscreenshot 03:21:17 INFO - Running setup.py install for moztest 03:21:17 INFO - Running setup.py install for mozversion 03:21:18 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:21:18 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:21:18 INFO - Cleaning up... 03:21:18 INFO - Return code: 0 03:21:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:21:18 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:21:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:18 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:21:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:18 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 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:21:18 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:21:18 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:21:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:18 INFO - 'HOME': '/Users/cltbld', 03:21:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:18 INFO - 'LOGNAME': 'cltbld', 03:21:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:18 INFO - 'MOZ_NO_REMOTE': '1', 03:21:18 INFO - 'NO_EM_RESTART': '1', 03:21:18 INFO - 'PAGER': '/bin/cat', 03:21:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:18 INFO - 'PWD': '/builds/slave/test', 03:21:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:18 INFO - 'SHELL': '/bin/bash', 03:21:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:18 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:18 INFO - 'USER': 'cltbld', 03:21:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:18 INFO - 'XPC_FLAGS': '0x0', 03:21:18 INFO - 'XPC_SERVICE_NAME': '0', 03:21:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:21:18 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-lrv8AE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:21:18 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:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:21:18 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-Ixpftf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:21:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:21:18 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-MgHaOb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:21:18 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:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:21:18 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-noNU_R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:21:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:21:18 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-_9hVlR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:21:18 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:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:21:18 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-Gt3AUt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:21:18 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:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:21:18 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-iEAkuW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:21:19 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:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-jGfBip-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:21:19 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:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-cM8ysm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:21:19 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:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-OpkAUd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:21:19 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:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-QzyPTL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:21:19 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:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-ifK06I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:21:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 03:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-MEPssb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:21:19 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:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-CGbfH_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:21:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 03:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-ZZBTkC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:21:19 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:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-_ABF5N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:21:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 03:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:21:19 INFO - Running setup.py (path:/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/pip-SnEsPf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:21:20 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:21:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:21:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:21:20 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:21:20 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:21:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:21:20 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:21:20 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:21:20 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:21:20 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:21:20 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:21:20 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:21:20 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:21:22 INFO - Downloading blessings-1.6.tar.gz 03:21:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:21:22 INFO - Installing collected packages: blessings 03:21:22 INFO - Running setup.py install for blessings 03:21:22 INFO - Successfully installed blessings 03:21:22 INFO - Cleaning up... 03:21:22 INFO - Return code: 0 03:21:22 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:21:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:21:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:21:23 INFO - Reading from file tmpfile_stdout 03:21:23 INFO - Current package versions: 03:21:23 INFO - blessings == 1.6 03:21:23 INFO - blobuploader == 1.2.4 03:21:23 INFO - docopt == 0.6.1 03:21:23 INFO - functools32 == 3.2.3-2 03:21:23 INFO - jsonschema == 2.5.1 03:21:23 INFO - manifestparser == 1.1 03:21:23 INFO - mozInstall == 1.12 03:21:23 INFO - mozcrash == 0.17 03:21:23 INFO - mozdebug == 0.1 03:21:23 INFO - mozdevice == 0.48 03:21:23 INFO - mozfile == 1.2 03:21:23 INFO - mozhttpd == 0.7 03:21:23 INFO - mozinfo == 0.9 03:21:23 INFO - mozleak == 0.1 03:21:23 INFO - mozlog == 3.4 03:21:23 INFO - moznetwork == 0.27 03:21:23 INFO - mozprocess == 0.23 03:21:23 INFO - mozprofile == 0.28 03:21:23 INFO - mozrunner == 6.12 03:21:23 INFO - mozscreenshot == 0.1 03:21:23 INFO - mozsystemmonitor == 0.3 03:21:23 INFO - moztest == 0.7 03:21:23 INFO - mozversion == 1.4 03:21:23 INFO - psutil == 3.1.1 03:21:23 INFO - requests == 1.2.3 03:21:23 INFO - wsgiref == 0.1.2 03:21:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:21:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:21:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:21:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:23 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 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:21:23 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:21:23 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:21:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:23 INFO - 'HOME': '/Users/cltbld', 03:21:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:23 INFO - 'LOGNAME': 'cltbld', 03:21:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:23 INFO - 'MOZ_NO_REMOTE': '1', 03:21:23 INFO - 'NO_EM_RESTART': '1', 03:21:23 INFO - 'PAGER': '/bin/cat', 03:21:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:23 INFO - 'PWD': '/builds/slave/test', 03:21:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:23 INFO - 'SHELL': '/bin/bash', 03:21:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:23 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:23 INFO - 'USER': 'cltbld', 03:21:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:23 INFO - 'XPC_FLAGS': '0x0', 03:21:23 INFO - 'XPC_SERVICE_NAME': '0', 03:21:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:23 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:21:23 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:21:23 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:21:23 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:21:23 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:21:23 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:21:23 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:21:23 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:21:23 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:21:23 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:21:23 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:21:23 INFO - Cleaning up... 03:21:23 INFO - Return code: 0 03:21:23 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:21:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:21:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:21:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109bbc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109b32570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9e95a3b40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, '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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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:21:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 03:21:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 03:21:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:23 INFO - 'HOME': '/Users/cltbld', 03:21:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:23 INFO - 'LOGNAME': 'cltbld', 03:21:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:23 INFO - 'MOZ_NO_REMOTE': '1', 03:21:23 INFO - 'NO_EM_RESTART': '1', 03:21:23 INFO - 'PAGER': '/bin/cat', 03:21:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:23 INFO - 'PWD': '/builds/slave/test', 03:21:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:23 INFO - 'SHELL': '/bin/bash', 03:21:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:23 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:23 INFO - 'USER': 'cltbld', 03:21:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:23 INFO - 'XPC_FLAGS': '0x0', 03:21:23 INFO - 'XPC_SERVICE_NAME': '0', 03:21:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:24 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:21:24 INFO - Cleaning up... 03:21:24 INFO - Return code: 0 03:21:24 INFO - Running post-action listener: _resource_record_post_action 03:21:24 INFO - Running post-action listener: _start_resource_monitoring 03:21:24 INFO - Starting resource monitoring. 03:21:24 INFO - [mozharness: 2016-11-07 11:21:24.167760Z] Finished create-virtualenv step (success) 03:21:24 INFO - [mozharness: 2016-11-07 11:21:24.168733Z] Running install step. 03:21:24 INFO - Running pre-action listener: _resource_record_pre_action 03:21:24 INFO - Running main action method: install 03:21:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:21:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:21:24 INFO - Reading from file tmpfile_stdout 03:21:24 INFO - Detecting whether we're running mozinstall >=1.0... 03:21:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:21:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:21:24 INFO - Reading from file tmpfile_stdout 03:21:24 INFO - Output received: 03:21:24 INFO - Usage: mozinstall [options] installer 03:21:24 INFO - Options: 03:21:24 INFO - -h, --help show this help message and exit 03:21:24 INFO - -d DEST, --destination=DEST 03:21:24 INFO - Directory to install application into. [default: 03:21:24 INFO - "/builds/slave/test"] 03:21:24 INFO - --app=APP Application being installed. [default: firefox] 03:21:24 INFO - mkdir: /builds/slave/test/build/application 03:21:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 03:21:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 03:21:56 INFO - Reading from file tmpfile_stdout 03:21:56 INFO - Output received: 03:21:56 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 03:21:56 INFO - Running post-action listener: _resource_record_post_action 03:21:56 INFO - [mozharness: 2016-11-07 11:21:56.820008Z] Finished install step (success) 03:21:56 INFO - [mozharness: 2016-11-07 11:21:56.820143Z] Running run-tests step. 03:21:56 INFO - Running pre-action listener: _resource_record_pre_action 03:21:56 INFO - Running main action method: run_tests 03:21:56 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:21:56 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:21:56 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:21:56 INFO - 2016-11-07 03:21:56.834 screenresolution[1641:7509] starting screenresolution argv=screenresolution get 03:21:56 INFO - 2016-11-07 03:21:56.837 screenresolution[1641:7509] Display 0: 1600x1200x32@60 03:21:56 INFO - 2016-11-07 03:21:56.843 screenresolution[1642:7513] starting screenresolution argv=screenresolution list 03:21:56 INFO - Available Modes on Display 0 03:21:56 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:21:56 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:21:56 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:21:56 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:21:57 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:21:57 INFO - Intel Iris: 03:21:57 INFO - Chipset Model: Intel Iris 03:21:57 INFO - Type: GPU 03:21:57 INFO - Bus: Built-In 03:21:57 INFO - VRAM (Dynamic, Max): 1536 MB 03:21:57 INFO - Vendor: Intel (0x8086) 03:21:57 INFO - Device ID: 0x0a2e 03:21:57 INFO - Revision ID: 0x0009 03:21:57 INFO - Displays: 03:21:57 INFO - Display: 03:21:57 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:21:57 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:21:57 INFO - Display Serial Number: 1600x1200 60 03:21:57 INFO - Main Display: Yes 03:21:57 INFO - Mirror: Off 03:21:57 INFO - Online: Yes 03:21:57 INFO - Rotation: Supported 03:21:57 INFO - Return code: 0 03:21:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:21:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:21:57 INFO - Python 2.7.3 03:21:57 INFO - Return code: 0 03:21:57 INFO - grabbing minidump binary from tooltool 03:21:57 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:21:57 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 0x1099d0d30>, '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 0x109836db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1099c8b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:21:57 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:21:57 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:21:57 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:21:57 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:21:57 INFO - Return code: 0 03:21:57 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 03:21:57 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:21:57 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:21:57 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 03:21:57 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:21:57 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-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0303', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 03:21:57 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-e10s --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0303 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 03:21:57 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.lvtgSAxOQd/Render', 03:21:57 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:21:57 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:21:57 INFO - 'HOME': '/Users/cltbld', 03:21:57 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:21:57 INFO - 'LOGNAME': 'cltbld', 03:21:57 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:21:57 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 03:21:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:57 INFO - 'MOZ_NO_REMOTE': '1', 03:21:57 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:21:57 INFO - 'NO_EM_RESTART': '1', 03:21:57 INFO - 'PAGER': '/bin/cat', 03:21:57 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:21:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:57 INFO - 'PWD': '/builds/slave/test', 03:21:57 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:21:57 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:21:57 INFO - 'SHELL': '/bin/bash', 03:21:57 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.MDyoMqXCnU/Listeners', 03:21:57 INFO - 'TMPDIR': '/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/', 03:21:57 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:21:57 INFO - 'USER': 'cltbld', 03:21:57 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:21:57 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:21:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:57 INFO - 'XPC_FLAGS': '0x0', 03:21:57 INFO - 'XPC_SERVICE_NAME': '0', 03:21:57 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 03:21:57 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0303', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 03:21:57 INFO - mozversion application_buildid: 20161107004002 03:21:57 INFO - mozversion application_changeset: 8027a7b723c9db7254bdb0bea3bc8937220daa7e 03:21:57 INFO - mozversion application_display_name: FirefoxDeveloperEdition 03:21:57 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:21:57 INFO - mozversion application_name: Firefox 03:21:57 INFO - mozversion application_remotingname: firefox-dev 03:21:57 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:21:57 INFO - mozversion application_vendor: Mozilla 03:21:57 INFO - mozversion application_version: 51.0a2 03:21:57 INFO - mozversion platform_buildid: 20161107004002 03:21:57 INFO - mozversion platform_changeset: 8027a7b723c9db7254bdb0bea3bc8937220daa7e 03:21:57 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:21:57 INFO - mozversion platform_version: 51.0a2 03:21:57 INFO - using testdate: 1478517717 03:21:57 INFO - actual date: 1478517717 03:21:57 INFO - starting webserver on 'localhost:49272' 03:21:57 INFO - SUITE-START | Running 2 tests 03:21:57 INFO - TEST-START | dromaeo_css 03:21:57 INFO - operating with platform_type : mac_ 03:21:57 INFO - Initialising browser for dromaeo_css test... 03:21:57 INFO - TEST-INFO | started process 1652 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/tmp0sJHKr/profile http://localhost:49272/getInfo.html) 03:22:00 INFO - PROCESS | 1652 | __metrics Screen width/height:1600/1200 03:22:00 INFO - PROCESS | 1652 | colorDepth:24 03:22:00 INFO - PROCESS | 1652 | Browser inner width/height: 1024/689 03:22:00 INFO - PROCESS | 1652 | __metrics 03:22:00 ERROR - PROCESS | 1652 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 03:22:01 INFO - TEST-INFO | 1652: exit 0 03:22:01 INFO - Browser initialized. 03:22:01 INFO - Running cycle 1/1 for dromaeo_css test... 03:22:01 INFO - TEST-INFO | started process 1656 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/tmp0sJHKr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:22:13 INFO - PROCESS | 1656 | RSS: Main: 224813056 03:22:13 INFO - PROCESS | 1656 | 03:23:02 INFO - PROCESS | 1656 | 1478517782946 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 03:25:15 INFO - PROCESS | 1656 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49272/tests/dromaeo/cssquery-ext.html) 03:25:16 INFO - PROCESS | 1656 | RSS: Main: 236843008 03:25:16 INFO - PROCESS | 1656 | 03:28:19 INFO - PROCESS | 1656 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-ext.html (next: http://localhost:49272/tests/dromaeo/cssquery-jquery.html) 03:28:19 INFO - PROCESS | 1656 | RSS: Main: 248885248 03:28:19 INFO - PROCESS | 1656 | 03:31:21 INFO - PROCESS | 1656 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49272/tests/dromaeo/cssquery-mootools.html) 03:31:22 INFO - PROCESS | 1656 | RSS: Main: 251293696 03:31:22 INFO - PROCESS | 1656 | 03:34:24 INFO - PROCESS | 1656 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49272/tests/dromaeo/cssquery-prototype.html) 03:34:24 INFO - PROCESS | 1656 | RSS: Main: 251367424 03:34:24 INFO - PROCESS | 1656 | 03:37:27 INFO - PROCESS | 1656 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49272/tests/dromaeo/cssquery-yui.html) 03:37:28 INFO - PROCESS | 1656 | RSS: Main: 257118208 03:37:28 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | Cycle 1(1): loaded http://localhost:49272/tests/dromaeo/cssquery-yui.html (next: http://localhost:49272/tests/dromaeo/cssquery-dojo.html) 03:40:31 INFO - PROCESS | 1656 | RSS: Main: 258891776 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | __start_tp_report 03:40:31 INFO - PROCESS | 1656 | _x_x_mozilla_page_load 03:40:31 INFO - PROCESS | 1656 | _x_x_mozilla_page_load_details 03:40:31 INFO - PROCESS | 1656 | |i|pagename|runs| 03:40:31 INFO - PROCESS | 1656 | |0;dojo.html;3324.384988777076;3442.2254992626663;3483.8258087095637;3487.4943133245674;3517.4547945068507;5913.379095195001;5946.821595352136;5996.88006239876;6004.369541198177;6007.978643630582;5949.018411962021;5999.730012149453;6035.939640603593;6042.788502402417;6059.66671833049;5323.281357016792;5398.217258497515;5421.647592906468;5467.890642187154;5530.6128571000045;5443.836684899459;5461.098918678433;5469.371022332423;5471.37079235889;5477.20580515825;5325.360956685184;5350.438203988583;5467.234587157801;5468.152436372348;5468.425815289397;5357.357117145948;5359.946400536022;5360.517553420192;5364.1149210380245;5419.701916394597;5318.9202161967605;5327.680339179623;5329.813456529003;5401.540869026098;5434.592405569559;6004.669743164124;6010.639361638316;6031.879362412771;6093.817185484442;6096.847578810521;6126.571140020201;6151.446369826737;6178.938210617881;6205.658688772116;6219.844503887393;6246.781362652286;6253.437190652863;6264.59280146789;6283.8114856554375;6284.18305620271;5841.283803031611;5907.7046147692445;6004.129401236796;6018.127371531104;6039.456448919618;6253.437190652863;6277.686115694197;6299.716512756937;6372.458341041063;6389.073584330339;6209;6213.875722485615;6244.843878902973;6250.15622890913;6260.186175797117;6120.693965301717;6268.937310626927;6274.6548939808745;6277.843053923689;6301.558890877686;5087.745612719349;5175.4565770593545;5192.948070519322;5438.5377242934;6171.197744293303;5532.1425179097305;6207.720652570645;6233.532485063638;6244.250689917239;6244.968775156095;4892.143874821892;5054.772535235923;5061.1902095665255;5068.82259120929;5071.644984851025;4431.113777244564;4455;4479.977600111979;4509.661775366861;4571.817127314936;6117.051856962089;6134.294556126013;6139.293981192131;6146.416090471398;6162.845928851814;6130.428711073822;6240.313565507881;6253.5622506425025;6319.33646967071;6329.113924050636;5998.940010599838;6002.639841609517;6040.456358927718;6051.183090282755;6111.774065234738;5531.363893152258;5531.9723401382735;5539.972300138474;5540.9168862467095;5588.050031494656;6347.079673447417;6410.326915673881;6431.292557818542;6436.452901503425;6436.806895793134;5259.421463639073;6162.722677479434;6183.350748171557;6194.938050619436;6215.533834962305;6403.391677790602;6432.774852880127;6450.354964503512;6458.870822583616;6474.741010359533;6233.937660623517;6234.1583886174785;6234.688265586612;6235.625862448268;6235.937640623536;6135.785247516494;6193.597416167935;6197.4422301991235;6200.844978875564;6250.031245157008;6238.656873871981;6245.156903817927;6245.3754624539;6245.812625621239;6249.343818899132;6033.396660333931;6201.255849297932;6229.159063526366;6244.0321750128805;6261.7182226799;5116.30929824469;5894.322152952465;6045.244344456943;6105.603135796159;6198.659073750987;6171.1668924694595;6179.938200617937;6208.379162083756;6233.096201050913;6261.749530018748;6169.81490555284;6174.598651087665;6185.907211391743;6202.689865506797;6232.968835155795 03:40:31 INFO - PROCESS | 1656 | |1;ext.html;468.7609319247183;477.07923707245016;483.25337353788393;537.8252068077874;549.2694716027684;36911.44632830509;39442.40836387453;39652.60347396525;39679.8096057118;39696.99999999996;41602.58397416025;41606;41753;41954.790226048826;42341.57658423415;9744.512774361288;9802.754931126743;9918.156956658657;9918.752031199205;9946.55240514175;9809.264305177105;9871.457069861155;9873.259505537078;9881.752956176117;9908;9692;9724.02759724029;9801.16690081344;9820;9881.16010139139;9799.559019844124;9829.164521015686;9872.851907221397;9883;9883.85174222391;9682;9815.754606134833;9839.311248212627;9894.505274736235;9937.950310248474;38726.806365968274;39470;39562.60437395618;39575.80212098921;39603.60396396028;3345.916352091193;3455.291665208626;3502.5446691929887;3931.87941436692;4238.978805105986;28308.150755477163;29134.70865291341;29199.562006569708;29254.85372573145;30381.848090759406;3216.163797412666;3284.835758212104;3364.562606861117;3408;3429;421231.9999999969;421501;424363;426530;427352;56735;64852;66727;67120;70808;65663.68672626521;65805.67097164484;66297.66851165713;68263;70689.2931070693;17043.659126817394;17265;17269.39557115495;17302.567435813955;17315.220815063352;13119.475220991053;13153.079284450188;13215.801762973562;13241.337933103307;13372.866271337356;19898.801011989694;20351;20509.58980820405;20523.897380513;20584.382468525968;7723.034620672416;8268;8411.663533458594;8433.451825631315;8466.957665211634;873.930085593151;977.53567055648;988.5996171550534;1082.9079528240031;1085.4193006741355;22572.322830314788;25693.100741473958;26905.596416053773;28428.85785571059;29754;942.2979879989451;956.7657721539275;1011.5498603121688;1045.4041196517912;1091.5306418240234;13871.020537720213;16672.916635416746;17292.567685807957;17549.385771497935;17743.11284435773;719921;730138;730687;730801;730949;51500;51878.48121518812;52168;52179;52372;1390.32569203936;1397.189630014589;1422.665673566711;1428.492885025801;1429.113949351388;30245.69754302517;30567.471626418144;31534.36931261408;31864.044078677678;32225.35549289048;51747;52472.68818279573;52571.73714131558;52667.736661317984;52824.735876320374;638197;644492;645148;646497;646856;43068.35397469103;43402.782986084865;43500.12999740051;43935.462258820786;44276.55723442853;46230;47277.527224728685;47278;47580.76209619068;47865;38388.232235355696;38462.42306365351;38848.805755971036;39293.803530982164;40077.99805004781;39057.609423906535;39205;39522;39901;40505;37781.43327850029;38346.233075338896;38677;38832.22335553329;39069.41395879007;33112.668873310955;35417.82291088528;35590.1940207193;35818.10454738652;36286.27427451489;25779.613305800052;26114;26170.345741356618;26384.208473745817;26551.867240663672 03:40:31 INFO - PROCESS | 1656 | |2;jquery.html;353.79126315473866;368.3517010062291;377.2944593609949;381.91406933439964;395.52932010907017;19273.614527709455;19331.323403680857;19792;19805;20019.699704504408;11427.885721142786;11556.075513958884;11936.403179840994;11949.402529873494;11993.100517461204;5218;5509.090999984997;5558.777648894039;5632.549396048326;5647.98336299466;3903.355946268862;4117.032497363117;4779.354787103749;5532.28080349554;5556.277683901108;4389.824407023715;6522.869542609145;6821.249662537117;6847.417969472601;6848;5224.242484839696;5793.420657934215;6215.570418803655;6245.500359971192;6267.341929097424;5020.723860187688;6003.459688628001;6014.428629280212;6016.157737916695;6020.036794112921;21344.252951146635;22218;23612;24274.029038838424;24287.87856060726;2167.8482506224573;2183.836212284085;2337.403961989699;2538.8349757265905;2893.6816950135467;9495.477748723817;10328.690139295759;10337.89662103377;10385.221108416823;10413.323133996342;1867.7291792690119;1895.2703209264532;2002.1791065663008;2014.355406269994;2017.6670849309846;118144.81855181424;119570.40214798957;122458;125736.11395828979;128573.35713321467;11144.665660030212;11436.828447573293;11693.415329233505;11704.35626040559;11989.64031079069;14662.413503459955;14726.558203253919;14737.48418805358;14786.926065369604;14790;8518.531480768617;8602.096779838152;8768.868466973001;8817.206451419403;8838.86741698875;8438.620262088221;8512.616932238065;8519.57402129891;8724.214820666044;8735.912640873637;4203.642690371353;4554.180247555406;4593.104344652827;4594.356790049395;4598.195315819718;1903.5812121333286;1965.9213631454581;1968.6850103983581;2000.6398848207461;2014.5567975045467;834.3658819297377;888.4092078767676;903.9965638141657;952.6189524190379;981.4454833019321;20305;20686.379408617766;20868;20902.85034323127;21040.579188416144;772.058089131259;911.1753862754218;943.5989704375613;963.7638778499313;989.2827699917646;10730.678079657622;11115.388653624128;11161.665150045512;11162.609308674157;11215.831762523569;605648;607853;610505;612797;613701;118716.21925671122;131914;133944.33027834797;136101;149292;969.2972594868663;1002.173207104142;1003.8343673293971;1013.5388398278913;1018.4653057145058;17497;18940.3370882024;19267.71098433553;19351.12919918635;19360.70958935645;53322.73338633282;54580.727096364266;54673.179902300704;55435.722821385636;56811;84264;87333;88251;88777;89200;7575.7878539597;7796.674565323795;8199.262066414052;8283.875741863756;8477.194666506672;10958.780824383628;12955;13074.477020919438;13335.533256335983;13445;11091.944540277247;11169.106471482424;11290.322580645188;11442.885571144516;11479.540818367172;9780.510974451106;11178.664640060812;11449.828252576384;11480.425978701198;11555.191136620357;9515.857262141211;11265.831012534654;11325.15061370417;11529.538818447503;11680.766384672428;6644.933550664431;6805.523613347018;7255.927440725525;7278.308560686726;8212.219839115274;10115.595376185165;10889.618863339745;10900.94549527279;11052.447377630926;11199 03:40:31 INFO - PROCESS | 1656 | |3;mootools.html;1515.5907904865683;1532.9616759581013;1727.5162954372772;1822.6810308196063;1868.962620747585;8128.634211460484;8395.580220988957;8650.956745216274;9067.501287429188;9212.953935230324;8625.95687021564;8917.68788092417;8969.282457403408;8971.730848074569;8975.281977441806;2370.288913326004;2407.109369533275;2408.771166739166;2409.77107174819;2424.163663536086;2370.6918100646976;2373.549025685123;2390.1156572068357;2415.384077060356;2419.9879000604974;2412.3969007748065;2412.9155479558217;2419.661247425362;2425.866577338246;2429.7205821330595;2083.718697975769;2298.321995011467;2379.7858192762646;2383.2969274064194;2387.940301492459;2391.3423808452812;2404.987975060131;2410.602250628644;2414.6860908081835;2414.9034038638433;8906.821863562758;8969.192772650493;9037.141471560191;9040.502772347518;9078.228350590207;5284.603654725873;5312.973435132838;5377.354717433933;5475.904819036209;5478.835634930959;3624.836882340301;3629.7822130672243;3669.9082522936874;3675.9081022974374;3682.907927301812;1082.808910198775;1082.86464191976;1088.88022317545;1097.1223021582703;1106.004595863721;11618.95429411357;11642.941785291105;11717.121215908755;11800.173987820855;11813.350265735382;4728.71627702339;4733.5503127202865;4757.770616597219;4822.493638168012;4903.926441103386;10053.59785608582;10117.544710488046;10121.987801219819;10122.937091605423;10134.746631334128;5335.519803217729;5367.973160134175;5371.435999220103;5372.489613486712;5379.058664733656;4469.955300447019;4604.976975115103;4820.4456487504385;4874.488178741252;4959.628027897922;3977.940330895039;4028;4072.1041370898356;4109.856155034559;4140.482439695038;1305.4843336882068;1307.1111644081925;1313.9540116096082;1317.80232965056;1323.1597935310954;771.8803585444265;860.9139086091466;896.9416987895765;934.3086116273909;946.6024269806697;6056.66688332146;6117.235345581802;6188.690565471708;6219.595726277777;6265.812025639147;814.9307308878812;946.8579713043099;972.9854052189223;1041.2607048995146;1046.9528871200814;3932.6657234134846;3979.900502487461;4014.8996275093355;4066.694997875112;4103.97948010258;10591.84112238317;10971.945140274407;10977.451127443595;10987.780244395068;10987.945060274647;9003.909960900308;10773.515191816387;10815.35107893529;10836.916308369258;10876.564937402416;6681.76613818514;7878.330341920886;8125.959370203112;8186.959065204635;8288.627011784483;5761.251037365116;5960.5231581474245;6068;6081.27024757032;6088.726007329592;10211.897881021094;10255.94872025635;10305.021023002802;10343.379397235889;10417.270791044553;9962.950185249027;10370.844437333295;10374.481275936323;10489.160867130764;10518.053375195963;7102.644867756489;7326;7495.625218738932;7702.691892324245;7853.725119620786;7986.480878742863;8625.8706119407;8627.784305392164;8645.91354086451;8658.523781192094;7527.360174385239;7693.88459173124;7749.186335434923;7789;7886.487378320391;7467.3279404851655;7492.850142997218;7598.544087354777;7609.885851712118;7633.5419874807685;7036.964815175891;7155.391791697764;7171.569705817667;7176.246494118252;7183;4972.726500042532;5036.143855544639;5062.886165043685;5138.640295179302;5217.9478205217465;5101.642884998015;5129.281271078438;5166.483351664803;5226.216067589892;5256.4480729524375 03:40:31 INFO - PROCESS | 1656 | |4;prototype.html;301.2063213432605;304.45350595680753;307.4005688906631;310.5326483642117;311.9111053349796;4909.239067944474;5470.64440811347;5536.889262214753;5551.583631227664;5627.324721033477;5008.649394542384;5390.44230807667;5435.537979271767;5448.782048718056;5540.335159780821;3951.861684841031;4078.5309689385654;4104.486939132594;4153.777728915031;4176.45706058212;4144.606262405066;4170.353595192735;4199.874003779876;4201.600847919458;4218.3250679891225;3549.0594992327055;4066.759638310314;4159.443675657315;4186.28833098374;4213.96594451994;3378.814165220912;3463.965360346402;3627.2745450909792;3819.560750513671;4131.35963925592;3488.5116083748294;3506.68439840413;3518.9120271993147;3528.435450327935;3552.8223588820715;4385.868423947287;5237.554807841338;5380.24676545284;5411.675299482044;5435.0488664483955;3869.6517313441927;4320.740755554645;4549.7042692224895;4705.223638099709;4728.905421891577;4458.286674132123;4561.657875659305;5771.711414429262;5794;5834.737436815311;3871.380579107329;3895.8312506248294;3908.706846986459;3908.7459315144424;3929.7249192556533;5850.688977853766;5998.380437281953;6076.453119219292;6079.179310793031;6143.32423433422;3216.195951012247;3510.1567730138668;3901.51231096113;3907;3941.7832019238645;3420.7092397146025;3861.517310336208;4027.536833264212;4045.8988525287104;4048.7773172475795;3727.9440808387894;4208.537060923357;4234.894127646772;4733;4750.311204875274;5552.944470555323;5798.188253644493;5824.970875145682;5828.358880523139;5871.119332100219;1151.3897634253858;1187.4181650990952;1364.733876894016;1371.1156304183746;1373.450619752107;749.2544917806708;784.3685832904566;836.8577341851778;837.3008537870825;842.2714352085402;4496.955030449653;4813.219108929648;4988.351514303117;5317.787288508416;5544.63959842609;5475.780968761205;5839.357670656224;6024.909626355608;6026.397360263939;6038.788642397495;4617.653675974316;4844.947682959712;5171.9482805171465;5539.529140023144;5540;2794.678611959651;2925.824450532975;2978.8659510322086;2999.7300242978235;3189.952150717741;5682.602217844794;6217.533684973645;6279.843003924847;6284.183056202664;6292.968535157295;5352;5615.691136987505;5812.680302583399;5817.76728930838;6113.205283313141;5506.724663766876;5516.724163791714;6253.155823963707;6253.249610046823;6254.436390902274;4517.706349087299;4974.602031837372;5369.677819330853;5375.274337964324;5971.134185543159;5745.1382292656435;5856.590038697421;5927.851803704942;5970.791022314198;5973.731182096903;5462.535684466865;5706.857328566819;5761.366249712444;5825.718341964931;6276.686165691788;3231.7253033491475;3292.27569934614;3412.788460096729;3935.449037134746;3940.226897895901;4759.571638552547;4971.726555039508;5393.298871146726;5498.615096943176;5991.490723288569;4284.592963668447;5067.594592432671;5427.918581221364;5703.401142879938;5866.6186697864505;4635.212013957703;5562.972185139049;5723.513501352431;5734.251053428744;5812.041013232938;4689.976550117228;5744.524562639543;5806.216160818235;5814.953308404528;5831.950248955229;5007.198848184419;5545.972270138624;5637.238972738628;5843.6851708365275;5861.296644402699;5082.059818933361;5266.762310856869;5654.236678048411;5686.630369026;5784.248047753765 03:40:31 INFO - PROCESS | 1656 | |5;yui.html;640.2573015302249;648.9318621544735;765.2615226306613;776.9666343762796;795.5481246724729;15190.164540950258;15891.92054039731;15949.362025518965;17522.211500482477;18218.635627287447;15821.367145314174;15932.362705491767;16011;16017.19914004298;16082.678346433064;831.6922738586716;861.9569021548929;864.6411739128285;866.8167950747247;868.1448772958631;677.3531277629876;698.6262349642942;843.1905370843997;859.188067276424;860.096898256831;911.5943405184695;911.6581282019242;915.1763412928351;917.7430319510514;918.8162367526521;867.8568036274007;904.968326108583;908.4095338030301;911.9908800911973;913.5980168725739;659.831742905556;661.6989269882192;666.453508123339;668.615546061012;671.6272468779825;15395.384184632601;15436.845631543652;15475;15477.303521341566;15484;14202.786958195635;14240.145591264558;14251;14298.928505357511;14485.56543303692;11418.714532136763;11626.709332266677;11667.474963626657;11767.823482647767;12018.338991355471;3817.48463957365;3822.617738226183;3823.9617603823885;3945.1123497213184;3958.267720471722;123264;123517.38241308735;124248.37875810562;124380.37809810984;124443.37778311051;10557.894421055844;10690.30513016667;10811.567537298577;10865.967733065347;11181.105511559055;20676.689849652266;20768.169273229203;20981.055852486676;20999.16003359879;21388.57222855565;7853.175416581291;7887.921120788718;8154.469959452616;8181.631826567819;8401.025758946642;4506.301523263899;4511.097780443924;4600.677952543289;4642.156691502692;4642.442906851199;3561.465780132949;3693;3757.28611563802;3764.171882185915;3781.1681430085337;667.8430568816324;674.2448457727377;677.3734295776387;681.5774219983642;705.108038331511;505.50460548662517;614.8893199224093;679.6669631880343;681.3969636871404;687.5084314715003;8249.29880960125;9629.470379129216;9655;9724.805503889882;9838.458884761263;649.2760571962323;669.5012215899186;670.4870773858003;690.147667630476;691.9723211071602;3913.5303763548554;4625.1443482955765;4752.429708434941;4791.880202994953;4801.639877009238;128074;142631.28684356512;143931.2803435997;143982.84025739622;163329.3667063314;111786;111973;113379;127052;143987.280063599;92320;96114.51942740381;108384.37423438655;109010;109589;9562.856557151508;9867.161291290033;9915.702528924145;10186.949065254626;10275.177985761271;60711;61155.69422152861;63115.42211444751;63568.364316356245;63940.3605963953;76588.61705691436;85530;86259;91079.54460227657;96047.55928660936;12645.747085058063;12966.870331296943;13125.278109704059;13217.867821321664;13635.386407611482;14018.509352172625;14329.426822926966;14860.554183374516;15003.174825384272;15143.772843407138;12912.677183070498;13206.405711742802;14434.350454229374;14586;14594;13455;13577;13612.183269003892;13848.446062157402;14168;13111.475540978254;13373;13480.932595337354;13562.660933476742;13575.38910748999;10497.265191436527;10874.441134490666;11060.008760402774;11393.544258229578;11422.086233101498;10319.864814870509;11034.944825275823;11341.886581134084;11646.126540509325;11832.763344732884 03:40:31 INFO - PROCESS | 1656 | __end_tp_report 03:40:31 INFO - PROCESS | 1656 | __start_cc_report 03:40:31 INFO - PROCESS | 1656 | _x_x_mozilla_cycle_collect,359 03:40:31 INFO - PROCESS | 1656 | __end_cc_report 03:40:31 INFO - PROCESS | 1656 | __startTimestamp1478518831347__endTimestamp 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | ------- Summary: start ------- 03:40:31 INFO - PROCESS | 1656 | Number of tests: 6 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | [#0] dojo.html Cycles:165 Average:5841.01 Median:6120.69 stddev:626.07 (10.2%) stddev-sans-first:596.05 03:40:31 INFO - PROCESS | 1656 | Values: 3324.4 3442.2 3483.8 3487.5 3517.5 5913.4 5946.8 5996.9 6004.4 6008.0 5949.0 5999.7 6035.9 6042.8 6059.7 5323.3 5398.2 5421.6 5467.9 5530.6 5443.8 5461.1 5469.4 5471.4 5477.2 5325.4 5350.4 5467.2 5468.2 5468.4 5357.4 5359.9 5360.5 5364.1 5419.7 5318.9 5327.7 5329.8 5401.5 5434.6 6004.7 6010.6 6031.9 6093.8 6096.8 6126.6 6151.4 6178.9 6205.7 6219.8 6246.8 6253.4 6264.6 6283.8 6284.2 5841.3 5907.7 6004.1 6018.1 6039.5 6253.4 6277.7 6299.7 6372.5 6389.1 6209.0 6213.9 6244.8 6250.2 6260.2 6120.7 6268.9 6274.7 6277.8 6301.6 5087.7 5175.5 5192.9 5438.5 6171.2 5532.1 6207.7 6233.5 6244.3 6245.0 4892.1 5054.8 5061.2 5068.8 5071.6 4431.1 4455.0 4480.0 4509.7 4571.8 6117.1 6134.3 6139.3 6146.4 6162.8 6130.4 6240.3 6253.6 6319.3 6329.1 5998.9 6002.6 6040.5 6051.2 6111.8 5531.4 5532.0 5540.0 5540.9 5588.1 6347.1 6410.3 6431.3 6436.5 6436.8 5259.4 6162.7 6183.4 6194.9 6215.5 6403.4 6432.8 6450.4 6458.9 6474.7 6233.9 6234.2 6234.7 6235.6 6235.9 6135.8 6193.6 6197.4 6200.8 6250.0 6238.7 6245.2 6245.4 6245.8 6249.3 6033.4 6201.3 6229.2 6244.0 6261.7 5116.3 5894.3 6045.2 6105.6 6198.7 6171.2 6179.9 6208.4 6233.1 6261.7 6169.8 6174.6 6185.9 6202.7 6233.0 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | [#1] ext.html Cycles:180 Average:73526.17 Median:41679.50 stddev:164194.75 (393.9%) stddev-sans-first:164563.74 03:40:31 INFO - PROCESS | 1656 | Values: 468.8 477.1 483.3 537.8 549.3 36911.4 39442.4 39652.6 39679.8 39697.0 41602.6 41606.0 41753.0 41954.8 42341.6 9744.5 9802.8 9918.2 9918.8 9946.6 9809.3 9871.5 9873.3 9881.8 9908.0 9692.0 9724.0 9801.2 9820.0 9881.2 9799.6 9829.2 9872.9 9883.0 9883.9 9682.0 9815.8 9839.3 9894.5 9938.0 38726.8 39470.0 39562.6 39575.8 39603.6 3345.9 3455.3 3502.5 3931.9 4239.0 28308.2 29134.7 29199.6 29254.9 30381.8 3216.2 3284.8 3364.6 3408.0 3429.0 421232.0 421501.0 424363.0 426530.0 427352.0 56735.0 64852.0 66727.0 67120.0 70808.0 65663.7 65805.7 66297.7 68263.0 70689.3 17043.7 17265.0 17269.4 17302.6 17315.2 13119.5 13153.1 13215.8 13241.3 13372.9 19898.8 20351.0 20509.6 20523.9 20584.4 7723.0 8268.0 8411.7 8433.5 8467.0 873.9 977.5 988.6 1082.9 1085.4 22572.3 25693.1 26905.6 28428.9 29754.0 942.3 956.8 1011.5 1045.4 1091.5 13871.0 16672.9 17292.6 17549.4 17743.1 719921.0 730138.0 730687.0 730801.0 730949.0 51500.0 51878.5 52168.0 52179.0 52372.0 1390.3 1397.2 1422.7 1428.5 1429.1 30245.7 30567.5 31534.4 31864.0 32225.4 51747.0 52472.7 52571.7 52667.7 52824.7 638197.0 644492.0 645148.0 646497.0 646856.0 43068.4 43402.8 43500.1 43935.5 44276.6 46230.0 47277.5 47278.0 47580.8 47865.0 38388.2 38462.4 38848.8 39293.8 40078.0 39057.6 39205.0 39522.0 39901.0 40505.0 37781.4 38346.2 38677.0 38832.2 39069.4 33112.7 35417.8 35590.2 35818.1 36286.3 25779.6 26114.0 26170.3 26384.2 26551.9 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | [#2] jquery.html Cycles:180 Average:35649.31 Median:12974.70 stddev:102195.61 (787.7%) stddev-sans-first:102447.93 03:40:31 INFO - PROCESS | 1656 | Values: 353.8 368.4 377.3 381.9 395.5 19273.6 19331.3 19792.0 19805.0 20019.7 11427.9 11556.1 11936.4 11949.4 11993.1 5218.0 5509.1 5558.8 5632.5 5648.0 3903.4 4117.0 4779.4 5532.3 5556.3 4389.8 6522.9 6821.2 6847.4 6848.0 5224.2 5793.4 6215.6 6245.5 6267.3 5020.7 6003.5 6014.4 6016.2 6020.0 21344.3 22218.0 23612.0 24274.0 24287.9 2167.8 2183.8 2337.4 2538.8 2893.7 9495.5 10328.7 10337.9 10385.2 10413.3 1867.7 1895.3 2002.2 2014.4 2017.7 118144.8 119570.4 122458.0 125736.1 128573.4 11144.7 11436.8 11693.4 11704.4 11989.6 14662.4 14726.6 14737.5 14786.9 14790.0 8518.5 8602.1 8768.9 8817.2 8838.9 8438.6 8512.6 8519.6 8724.2 8735.9 4203.6 4554.2 4593.1 4594.4 4598.2 1903.6 1965.9 1968.7 2000.6 2014.6 834.4 888.4 904.0 952.6 981.4 20305.0 20686.4 20868.0 20902.9 21040.6 772.1 911.2 943.6 963.8 989.3 10730.7 11115.4 11161.7 11162.6 11215.8 605648.0 607853.0 610505.0 612797.0 613701.0 118716.2 131914.0 133944.3 136101.0 149292.0 969.3 1002.2 1003.8 1013.5 1018.5 17497.0 18940.3 19267.7 19351.1 19360.7 53322.7 54580.7 54673.2 55435.7 56811.0 84264.0 87333.0 88251.0 88777.0 89200.0 7575.8 7796.7 8199.3 8283.9 8477.2 10958.8 12955.0 13074.5 13335.5 13445.0 11091.9 11169.1 11290.3 11442.9 11479.5 9780.5 11178.7 11449.8 11480.4 11555.2 9515.9 11265.8 11325.2 11529.5 11680.8 6644.9 6805.5 7255.9 7278.3 8212.2 10115.6 10889.6 10900.9 11052.4 11199.0 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | [#3] mootools.html Cycles:180 Average:5806.48 Median:4821.47 stddev:3233.35 (67.1%) stddev-sans-first:3226.34 03:40:31 INFO - PROCESS | 1656 | Values: 1515.6 1533.0 1727.5 1822.7 1869.0 8128.6 8395.6 8651.0 9067.5 9213.0 8626.0 8917.7 8969.3 8971.7 8975.3 2370.3 2407.1 2408.8 2409.8 2424.2 2370.7 2373.5 2390.1 2415.4 2420.0 2412.4 2412.9 2419.7 2425.9 2429.7 2083.7 2298.3 2379.8 2383.3 2387.9 2391.3 2405.0 2410.6 2414.7 2414.9 8906.8 8969.2 9037.1 9040.5 9078.2 5284.6 5313.0 5377.4 5475.9 5478.8 3624.8 3629.8 3669.9 3675.9 3682.9 1082.8 1082.9 1088.9 1097.1 1106.0 11619.0 11642.9 11717.1 11800.2 11813.4 4728.7 4733.6 4757.8 4822.5 4903.9 10053.6 10117.5 10122.0 10122.9 10134.7 5335.5 5368.0 5371.4 5372.5 5379.1 4470.0 4605.0 4820.4 4874.5 4959.6 3977.9 4028.0 4072.1 4109.9 4140.5 1305.5 1307.1 1314.0 1317.8 1323.2 771.9 860.9 896.9 934.3 946.6 6056.7 6117.2 6188.7 6219.6 6265.8 814.9 946.9 973.0 1041.3 1047.0 3932.7 3979.9 4014.9 4066.7 4104.0 10591.8 10971.9 10977.5 10987.8 10987.9 9003.9 10773.5 10815.4 10836.9 10876.6 6681.8 7878.3 8126.0 8187.0 8288.6 5761.3 5960.5 6068.0 6081.3 6088.7 10211.9 10255.9 10305.0 10343.4 10417.3 9963.0 10370.8 10374.5 10489.2 10518.1 7102.6 7326.0 7495.6 7702.7 7853.7 7986.5 8625.9 8627.8 8645.9 8658.5 7527.4 7693.9 7749.2 7789.0 7886.5 7467.3 7492.9 7598.5 7609.9 7633.5 7037.0 7155.4 7171.6 7176.2 7183.0 4972.7 5036.1 5062.9 5138.6 5217.9 5101.6 5129.3 5166.5 5226.2 5256.4 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | [#4] prototype.html Cycles:180 Average:4592.80 Median:5204.75 stddev:1462.63 (28.1%) stddev-sans-first:1430.83 03:40:31 INFO - PROCESS | 1656 | Values: 301.2 304.5 307.4 310.5 311.9 4909.2 5470.6 5536.9 5551.6 5627.3 5008.6 5390.4 5435.5 5448.8 5540.3 3951.9 4078.5 4104.5 4153.8 4176.5 4144.6 4170.4 4199.9 4201.6 4218.3 3549.1 4066.8 4159.4 4186.3 4214.0 3378.8 3464.0 3627.3 3819.6 4131.4 3488.5 3506.7 3518.9 3528.4 3552.8 4385.9 5237.6 5380.2 5411.7 5435.0 3869.7 4320.7 4549.7 4705.2 4728.9 4458.3 4561.7 5771.7 5794.0 5834.7 3871.4 3895.8 3908.7 3908.7 3929.7 5850.7 5998.4 6076.5 6079.2 6143.3 3216.2 3510.2 3901.5 3907.0 3941.8 3420.7 3861.5 4027.5 4045.9 4048.8 3727.9 4208.5 4234.9 4733.0 4750.3 5552.9 5798.2 5825.0 5828.4 5871.1 1151.4 1187.4 1364.7 1371.1 1373.5 749.3 784.4 836.9 837.3 842.3 4497.0 4813.2 4988.4 5317.8 5544.6 5475.8 5839.4 6024.9 6026.4 6038.8 4617.7 4844.9 5171.9 5539.5 5540.0 2794.7 2925.8 2978.9 2999.7 3190.0 5682.6 6217.5 6279.8 6284.2 6293.0 5352.0 5615.7 5812.7 5817.8 6113.2 5506.7 5516.7 6253.2 6253.2 6254.4 4517.7 4974.6 5369.7 5375.3 5971.1 5745.1 5856.6 5927.9 5970.8 5973.7 5462.5 5706.9 5761.4 5825.7 6276.7 3231.7 3292.3 3412.8 3935.4 3940.2 4759.6 4971.7 5393.3 5498.6 5991.5 4284.6 5067.6 5427.9 5703.4 5866.6 4635.2 5563.0 5723.5 5734.3 5812.0 4690.0 5744.5 5806.2 5815.0 5832.0 5007.2 5546.0 5637.2 5843.7 5861.3 5082.1 5266.8 5654.2 5686.6 5784.2 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - PROCESS | 1656 | [#5] yui.html Cycles:180 Average:24740.96 Median:3627.23 stddev:39079.32 (1077.4%) stddev-sans-first:39147.05 03:40:31 INFO - PROCESS | 1656 | Values: 640.3 648.9 765.3 777.0 795.5 15190.2 15891.9 15949.4 17522.2 18218.6 15821.4 15932.4 16011.0 16017.2 16082.7 831.7 862.0 864.6 866.8 868.1 677.4 698.6 843.2 859.2 860.1 911.6 911.7 915.2 917.7 918.8 867.9 905.0 908.4 912.0 913.6 659.8 661.7 666.5 668.6 671.6 15395.4 15436.8 15475.0 15477.3 15484.0 14202.8 14240.1 14251.0 14298.9 14485.6 11418.7 11626.7 11667.5 11767.8 12018.3 3817.5 3822.6 3824.0 3945.1 3958.3 123264.0 123517.4 124248.4 124380.4 124443.4 10557.9 10690.3 10811.6 10866.0 11181.1 20676.7 20768.2 20981.1 20999.2 21388.6 7853.2 7887.9 8154.5 8181.6 8401.0 4506.3 4511.1 4600.7 4642.2 4642.4 3561.5 3693.0 3757.3 3764.2 3781.2 667.8 674.2 677.4 681.6 705.1 505.5 614.9 679.7 681.4 687.5 8249.3 9629.5 9655.0 9724.8 9838.5 649.3 669.5 670.5 690.1 692.0 3913.5 4625.1 4752.4 4791.9 4801.6 128074.0 142631.3 143931.3 143982.8 163329.4 111786.0 111973.0 113379.0 127052.0 143987.3 92320.0 96114.5 108384.4 109010.0 109589.0 9562.9 9867.2 9915.7 10186.9 10275.2 60711.0 61155.7 63115.4 63568.4 63940.4 76588.6 85530.0 86259.0 91079.5 96047.6 12645.7 12966.9 13125.3 13217.9 13635.4 14018.5 14329.4 14860.6 15003.2 15143.8 12912.7 13206.4 14434.4 14586.0 14594.0 13455.0 13577.0 13612.2 13848.4 14168.0 13111.5 13373.0 13480.9 13562.7 13575.4 10497.3 10874.4 11060.0 11393.5 11422.1 10319.9 11034.9 11341.9 11646.1 11832.8 03:40:31 INFO - PROCESS | 1656 | -------- Summary: end -------- 03:40:31 INFO - PROCESS | 1656 | 03:40:31 INFO - TEST-INFO | 1656: exit 0 03:40:31 INFO - TEST-OK | dromaeo_css | took 1114538ms 03:40:31 INFO - TEST-START | kraken 03:40:31 INFO - operating with platform_type : mac_ 03:40:31 INFO - Initialising browser for kraken test... 03:40:31 INFO - TEST-INFO | started process 1690 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/tmpEl8Uxy/profile http://localhost:49272/getInfo.html) 03:40:34 INFO - PROCESS | 1690 | __metrics Screen width/height:1600/1200 03:40:34 INFO - PROCESS | 1690 | colorDepth:24 03:40:34 INFO - PROCESS | 1690 | Browser inner width/height: 1024/689 03:40:34 INFO - PROCESS | 1690 | __metrics 03:40:34 ERROR - PROCESS | 1690 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 03:40:35 INFO - TEST-INFO | 1690: exit 0 03:40:35 INFO - Browser initialized. 03:40:35 INFO - Running cycle 1/1 for kraken test... 03:40:35 INFO - TEST-INFO | started process 1693 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/T/tmpEl8Uxy/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:40:47 INFO - PROCESS | 1693 | RSS: Main: 225726464 03:40:47 INFO - PROCESS | 1693 | 03:40:50 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49272/tests/kraken/driver.html?testName=audio-beat-detection) 03:40:51 INFO - PROCESS | 1693 | RSS: Main: 238206976 03:40:51 INFO - PROCESS | 1693 | 03:40:54 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49272/tests/kraken/driver.html?testName=audio-dft) 03:40:54 INFO - PROCESS | 1693 | RSS: Main: 245760000 03:40:54 INFO - PROCESS | 1693 | 03:40:58 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49272/tests/kraken/driver.html?testName=audio-fft) 03:40:58 INFO - PROCESS | 1693 | RSS: Main: 249352192 03:40:58 INFO - PROCESS | 1693 | 03:41:00 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49272/tests/kraken/driver.html?testName=audio-oscillator) 03:41:01 INFO - PROCESS | 1693 | RSS: Main: 249847808 03:41:01 INFO - PROCESS | 1693 | 03:41:03 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49272/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:41:03 INFO - PROCESS | 1693 | RSS: Main: 251121664 03:41:03 INFO - PROCESS | 1693 | 03:41:06 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49272/tests/kraken/driver.html?testName=imaging-darkroom) 03:41:07 INFO - PROCESS | 1693 | RSS: Main: 251691008 03:41:07 INFO - PROCESS | 1693 | 03:41:10 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49272/tests/kraken/driver.html?testName=imaging-desaturate) 03:41:11 INFO - PROCESS | 1693 | RSS: Main: 251592704 03:41:11 INFO - PROCESS | 1693 | 03:41:14 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49272/tests/kraken/driver.html?testName=json-parse-financial) 03:41:14 INFO - PROCESS | 1693 | RSS: Main: 252104704 03:41:14 INFO - PROCESS | 1693 | 03:41:16 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49272/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:41:16 INFO - PROCESS | 1693 | RSS: Main: 251584512 03:41:16 INFO - PROCESS | 1693 | 03:41:18 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:41:19 INFO - PROCESS | 1693 | RSS: Main: 251682816 03:41:19 INFO - PROCESS | 1693 | 03:41:21 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:41:22 INFO - PROCESS | 1693 | RSS: Main: 251629568 03:41:22 INFO - PROCESS | 1693 | 03:41:25 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:41:26 INFO - PROCESS | 1693 | RSS: Main: 251977728 03:41:26 INFO - PROCESS | 1693 | 03:41:28 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:41:29 INFO - PROCESS | 1693 | RSS: Main: 251924480 03:41:29 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | Cycle 1(1): loaded http://localhost:49272/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49272/tests/kraken/driver.html?testName=ai-astar) 03:41:31 INFO - PROCESS | 1693 | RSS: Main: 253812736 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | __start_tp_report 03:41:31 INFO - PROCESS | 1693 | _x_x_mozilla_page_load 03:41:31 INFO - PROCESS | 1693 | _x_x_mozilla_page_load_details 03:41:31 INFO - PROCESS | 1693 | |i|pagename|runs| 03:41:31 INFO - PROCESS | 1693 | |0;ai-astar;105;109;120;119;117;118;121;117;119;100 03:41:31 INFO - PROCESS | 1693 | |1;audio-beat-detection;131;125;138;154;111;101;140;141;173;119 03:41:31 INFO - PROCESS | 1693 | |2;audio-dft;196;198;198;198;196;201;198;193;199;195 03:41:31 INFO - PROCESS | 1693 | |3;audio-fft;83;59;58;84;60;58;58;57;74;67 03:41:31 INFO - PROCESS | 1693 | |4;audio-oscillator;83;70;88;73;71;90;112;102;102;106 03:41:31 INFO - PROCESS | 1693 | |5;imaging-gaussian-blur;89;87;90;87;93;110;129;88;89;85 03:41:31 INFO - PROCESS | 1693 | |6;imaging-darkroom;95;97;98;153;111;135;155;107;152;112 03:41:31 INFO - PROCESS | 1693 | |7;imaging-desaturate;91;95;115;146;92;91;92;91;93;91 03:41:31 INFO - PROCESS | 1693 | |8;json-parse-financial;56;56;53;56;59;59;60;59;60;60 03:41:31 INFO - PROCESS | 1693 | |9;json-stringify-tinderbox;67;77;70;78;77;72;100;61;98;105 03:41:31 INFO - PROCESS | 1693 | |10;stanford-crypto-aes;84;86;84;81;83;81;85;86;82;105 03:41:31 INFO - PROCESS | 1693 | |11;stanford-crypto-ccm;139;139;139;136;158;156;166;146;186;168 03:41:31 INFO - PROCESS | 1693 | |12;stanford-crypto-pbkdf2;166;167;164;163;166;162;163;165;165;165 03:41:31 INFO - PROCESS | 1693 | |13;stanford-crypto-sha256-iterative;70;69;68;67;69;67;68;66;68;64 03:41:31 INFO - PROCESS | 1693 | __end_tp_report 03:41:31 INFO - PROCESS | 1693 | __start_cc_report 03:41:31 INFO - PROCESS | 1693 | _x_x_mozilla_cycle_collect,954 03:41:31 INFO - PROCESS | 1693 | __end_cc_report 03:41:31 INFO - PROCESS | 1693 | __startTimestamp1478518891350__endTimestamp 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | ------- Summary: start ------- 03:41:31 INFO - PROCESS | 1693 | Number of tests: 14 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#0] ai-astar Cycles:10 Average:114.50 Median:118.50 stddev:7.21 (6.1%) stddev-sans-first:6.78 03:41:31 INFO - PROCESS | 1693 | Values: 105.0 109.0 120.0 119.0 117.0 118.0 121.0 117.0 119.0 100.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#1] audio-beat-detection Cycles:10 Average:133.30 Median:139.00 stddev:20.95 (15.1%) stddev-sans-first:22.20 03:41:31 INFO - PROCESS | 1693 | Values: 131.0 125.0 138.0 154.0 111.0 101.0 140.0 141.0 173.0 119.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#2] audio-dft Cycles:10 Average:197.20 Median:198.00 stddev:2.25 (1.1%) stddev-sans-first:2.35 03:41:31 INFO - PROCESS | 1693 | Values: 196.0 198.0 198.0 198.0 196.0 201.0 198.0 193.0 199.0 195.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#3] audio-fft Cycles:10 Average:65.80 Median:63.50 stddev:10.73 (16.9%) stddev-sans-first:9.40 03:41:31 INFO - PROCESS | 1693 | Values: 83.0 59.0 58.0 84.0 60.0 58.0 58.0 57.0 74.0 67.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#4] audio-oscillator Cycles:10 Average:89.70 Median:72.00 stddev:15.38 (21.4%) stddev-sans-first:16.13 03:41:31 INFO - PROCESS | 1693 | Values: 83.0 70.0 88.0 73.0 71.0 90.0 112.0 102.0 102.0 106.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#5] imaging-gaussian-blur Cycles:10 Average:94.70 Median:88.50 stddev:13.98 (15.8%) stddev-sans-first:14.67 03:41:31 INFO - PROCESS | 1693 | Values: 89.0 87.0 90.0 87.0 93.0 110.0 129.0 88.0 89.0 85.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#6] imaging-darkroom Cycles:10 Average:121.50 Median:154.00 stddev:24.70 (16.0%) stddev-sans-first:24.27 03:41:31 INFO - PROCESS | 1693 | Values: 95.0 97.0 98.0 153.0 111.0 135.0 155.0 107.0 152.0 112.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#7] imaging-desaturate Cycles:10 Average:99.70 Median:91.50 stddev:17.85 (19.5%) stddev-sans-first:18.65 03:41:31 INFO - PROCESS | 1693 | Values: 91.0 95.0 115.0 146.0 92.0 91.0 92.0 91.0 93.0 91.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#8] json-parse-financial Cycles:10 Average:57.80 Median:59.00 stddev:2.39 (4.1%) stddev-sans-first:2.45 03:41:31 INFO - PROCESS | 1693 | Values: 56.0 56.0 53.0 56.0 59.0 59.0 60.0 59.0 60.0 60.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#9] json-stringify-tinderbox Cycles:10 Average:80.50 Median:74.50 stddev:15.14 (20.3%) stddev-sans-first:15.25 03:41:31 INFO - PROCESS | 1693 | Values: 67.0 77.0 70.0 78.0 77.0 72.0 100.0 61.0 98.0 105.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#10] stanford-crypto-aes Cycles:10 Average:85.70 Median:84.00 stddev:7.02 (8.4%) stddev-sans-first:7.42 03:41:31 INFO - PROCESS | 1693 | Values: 84.0 86.0 84.0 81.0 83.0 81.0 85.0 86.0 82.0 105.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#11] stanford-crypto-ccm Cycles:10 Average:153.30 Median:157.00 stddev:16.47 (10.5%) stddev-sans-first:16.64 03:41:31 INFO - PROCESS | 1693 | Values: 139.0 139.0 139.0 136.0 158.0 156.0 166.0 146.0 186.0 168.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:164.60 Median:165.00 stddev:1.58 (1.0%) stddev-sans-first:1.59 03:41:31 INFO - PROCESS | 1693 | Values: 166.0 167.0 164.0 163.0 166.0 162.0 163.0 165.0 165.0 165.0 03:41:31 INFO - PROCESS | 1693 | 03:41:31 INFO - PROCESS | 1693 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.60 Median:68.00 stddev:1.71 (2.5%) stddev-sans-first:1.58 03:41:31 INFO - PROCESS | 1693 | Values: 70.0 69.0 68.0 67.0 69.0 67.0 68.0 66.0 68.0 64.0 03:41:31 INFO - PROCESS | 1693 | -------- Summary: end -------- 03:41:31 INFO - PROCESS | 1693 | 03:41:32 INFO - TEST-INFO | 1693: exit 0 03:41:32 INFO - TEST-OK | kraken | took 60184ms 03:41:32 INFO - SUITE-END | took 1174s 03:41:32 INFO - Completed test suite (00:19:35) 03:41:32 INFO - javascript benchmark 03:41:32 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7459.81383460713, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3324.384988777076, 3442.2254992626663, 3483.8258087095637, 3487.4943133245674, 3517.4547945068507, 5913.379095195001, 5946.821595352136, 5996.88006239876, 6004.369541198177, 6007.978643630582, 5949.018411962021, 5999.730012149453, 6035.939640603593, 6042.788502402417, 6059.66671833049, 5323.281357016792, 5398.217258497515, 5421.647592906468, 5467.890642187154, 5530.6128571000045, 5443.836684899459, 5461.098918678433, 5469.371022332423, 5471.37079235889, 5477.20580515825, 5325.360956685184, 5350.438203988583, 5467.234587157801, 5468.152436372348, 5468.425815289397, 5357.357117145948, 5359.946400536022, 5360.517553420192, 5364.1149210380245, 5419.701916394597, 5318.9202161967605, 5327.680339179623, 5329.813456529003, 5401.540869026098, 5434.592405569559, 6004.669743164124, 6010.639361638316, 6031.879362412771, 6093.817185484442, 6096.847578810521, 6126.571140020201, 6151.446369826737, 6178.938210617881, 6205.658688772116, 6219.844503887393, 6246.781362652286, 6253.437190652863, 6264.59280146789, 6283.8114856554375, 6284.18305620271, 5841.283803031611, 5907.7046147692445, 6004.129401236796, 6018.127371531104, 6039.456448919618, 6253.437190652863, 6277.686115694197, 6299.716512756937, 6372.458341041063, 6389.073584330339, 6209.0, 6213.875722485615, 6244.843878902973, 6250.15622890913, 6260.186175797117, 6120.693965301717, 6268.937310626927, 6274.6548939808745, 6277.843053923689, 6301.558890877686, 5087.745612719349, 5175.4565770593545, 5192.948070519322, 5438.5377242934, 6171.197744293303, 5532.1425179097305, 6207.720652570645, 6233.532485063638, 6244.250689917239, 6244.968775156095, 4892.143874821892, 5054.772535235923, 5061.1902095665255, 5068.82259120929, 5071.644984851025, 4431.113777244564, 4455.0, 4479.977600111979, 4509.661775366861, 4571.817127314936, 6117.051856962089, 6134.294556126013, 6139.293981192131, 6146.416090471398, 6162.845928851814, 6130.428711073822, 6240.313565507881, 6253.5622506425025, 6319.33646967071, 6329.113924050636, 5998.940010599838, 6002.639841609517, 6040.456358927718, 6051.183090282755, 6111.774065234738, 5531.363893152258, 5531.9723401382735, 5539.972300138474, 5540.9168862467095, 5588.050031494656, 6347.079673447417, 6410.326915673881, 6431.292557818542, 6436.452901503425, 6436.806895793134, 5259.421463639073, 6162.722677479434, 6183.350748171557, 6194.938050619436, 6215.533834962305, 6403.391677790602, 6432.774852880127, 6450.354964503512, 6458.870822583616, 6474.741010359533, 6233.937660623517, 6234.1583886174785, 6234.688265586612, 6235.625862448268, 6235.937640623536, 6135.785247516494, 6193.597416167935, 6197.4422301991235, 6200.844978875564, 6250.031245157008, 6238.656873871981, 6245.156903817927, 6245.3754624539, 6245.812625621239, 6249.343818899132, 6033.396660333931, 6201.255849297932, 6229.159063526366, 6244.0321750128805, 6261.7182226799, 5116.30929824469, 5894.322152952465, 6045.244344456943, 6105.603135796159, 6198.659073750987, 6171.1668924694595, 6179.938200617937, 6208.379162083756, 6233.096201050913, 6261.749530018748, 6169.81490555284, 6174.598651087665, 6185.907211391743, 6202.689865506797, 6232.968835155795], "value": 5802.538781712056, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [468.7609319247183, 477.07923707245016, 483.25337353788393, 537.8252068077874, 549.2694716027684, 36911.44632830509, 39442.40836387453, 39652.60347396525, 39679.8096057118, 39696.99999999996, 41602.58397416025, 41606.0, 41753.0, 41954.790226048826, 42341.57658423415, 9744.512774361288, 9802.754931126743, 9918.156956658657, 9918.752031199205, 9946.55240514175, 9809.264305177105, 9871.457069861155, 9873.259505537078, 9881.752956176117, 9908.0, 9692.0, 9724.02759724029, 9801.16690081344, 9820.0, 9881.16010139139, 9799.559019844124, 9829.164521015686, 9872.851907221397, 9883.0, 9883.85174222391, 9682.0, 9815.754606134833, 9839.311248212627, 9894.505274736235, 9937.950310248474, 38726.806365968274, 39470.0, 39562.60437395618, 39575.80212098921, 39603.60396396028, 3345.916352091193, 3455.291665208626, 3502.5446691929887, 3931.87941436692, 4238.978805105986, 28308.150755477163, 29134.70865291341, 29199.562006569708, 29254.85372573145, 30381.848090759406, 3216.163797412666, 3284.835758212104, 3364.562606861117, 3408.0, 3429.0, 421231.9999999969, 421501.0, 424363.0, 426530.0, 427352.0, 56735.0, 64852.0, 66727.0, 67120.0, 70808.0, 65663.68672626521, 65805.67097164484, 66297.66851165713, 68263.0, 70689.2931070693, 17043.659126817394, 17265.0, 17269.39557115495, 17302.567435813955, 17315.220815063352, 13119.475220991053, 13153.079284450188, 13215.801762973562, 13241.337933103307, 13372.866271337356, 19898.801011989694, 20351.0, 20509.58980820405, 20523.897380513, 20584.382468525968, 7723.034620672416, 8268.0, 8411.663533458594, 8433.451825631315, 8466.957665211634, 873.930085593151, 977.53567055648, 988.5996171550534, 1082.9079528240031, 1085.4193006741355, 22572.322830314788, 25693.100741473958, 26905.596416053773, 28428.85785571059, 29754.0, 942.2979879989451, 956.7657721539275, 1011.5498603121688, 1045.4041196517912, 1091.5306418240234, 13871.020537720213, 16672.916635416746, 17292.567685807957, 17549.385771497935, 17743.11284435773, 719921.0, 730138.0, 730687.0, 730801.0, 730949.0, 51500.0, 51878.48121518812, 52168.0, 52179.0, 52372.0, 1390.32569203936, 1397.189630014589, 1422.665673566711, 1428.492885025801, 1429.113949351388, 30245.69754302517, 30567.471626418144, 31534.36931261408, 31864.044078677678, 32225.35549289048, 51747.0, 52472.68818279573, 52571.73714131558, 52667.736661317984, 52824.735876320374, 638197.0, 644492.0, 645148.0, 646497.0, 646856.0, 43068.35397469103, 43402.782986084865, 43500.12999740051, 43935.462258820786, 44276.55723442853, 46230.0, 47277.527224728685, 47278.0, 47580.76209619068, 47865.0, 38388.232235355696, 38462.42306365351, 38848.805755971036, 39293.803530982164, 40077.99805004781, 39057.609423906535, 39205.0, 39522.0, 39901.0, 40505.0, 37781.43327850029, 38346.233075338896, 38677.0, 38832.22335553329, 39069.41395879007, 33112.668873310955, 35417.82291088528, 35590.1940207193, 35818.10454738652, 36286.27427451489, 25779.613305800052, 26114.0, 26170.345741356618, 26384.208473745817, 26551.867240663672], "value": 20666.57308250615, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [353.79126315473866, 368.3517010062291, 377.2944593609949, 381.91406933439964, 395.52932010907017, 19273.614527709455, 19331.323403680857, 19792.0, 19805.0, 20019.699704504408, 11427.885721142786, 11556.075513958884, 11936.403179840994, 11949.402529873494, 11993.100517461204, 5218.0, 5509.090999984997, 5558.777648894039, 5632.549396048326, 5647.98336299466, 3903.355946268862, 4117.032497363117, 4779.354787103749, 5532.28080349554, 5556.277683901108, 4389.824407023715, 6522.869542609145, 6821.249662537117, 6847.417969472601, 6848.0, 5224.242484839696, 5793.420657934215, 6215.570418803655, 6245.500359971192, 6267.341929097424, 5020.723860187688, 6003.459688628001, 6014.428629280212, 6016.157737916695, 6020.036794112921, 21344.252951146635, 22218.0, 23612.0, 24274.029038838424, 24287.87856060726, 2167.8482506224573, 2183.836212284085, 2337.403961989699, 2538.8349757265905, 2893.6816950135467, 9495.477748723817, 10328.690139295759, 10337.89662103377, 10385.221108416823, 10413.323133996342, 1867.7291792690119, 1895.2703209264532, 2002.1791065663008, 2014.355406269994, 2017.6670849309846, 118144.81855181424, 119570.40214798957, 122458.0, 125736.11395828979, 128573.35713321467, 11144.665660030212, 11436.828447573293, 11693.415329233505, 11704.35626040559, 11989.64031079069, 14662.413503459955, 14726.558203253919, 14737.48418805358, 14786.926065369604, 14790.0, 8518.531480768617, 8602.096779838152, 8768.868466973001, 8817.206451419403, 8838.86741698875, 8438.620262088221, 8512.616932238065, 8519.57402129891, 8724.214820666044, 8735.912640873637, 4203.642690371353, 4554.180247555406, 4593.104344652827, 4594.356790049395, 4598.195315819718, 1903.5812121333286, 1965.9213631454581, 1968.6850103983581, 2000.6398848207461, 2014.5567975045467, 834.3658819297377, 888.4092078767676, 903.9965638141657, 952.6189524190379, 981.4454833019321, 20305.0, 20686.379408617766, 20868.0, 20902.85034323127, 21040.579188416144, 772.058089131259, 911.1753862754218, 943.5989704375613, 963.7638778499313, 989.2827699917646, 10730.678079657622, 11115.388653624128, 11161.665150045512, 11162.609308674157, 11215.831762523569, 605648.0, 607853.0, 610505.0, 612797.0, 613701.0, 118716.21925671122, 131914.0, 133944.33027834797, 136101.0, 149292.0, 969.2972594868663, 1002.173207104142, 1003.8343673293971, 1013.5388398278913, 1018.4653057145058, 17497.0, 18940.3370882024, 19267.71098433553, 19351.12919918635, 19360.70958935645, 53322.73338633282, 54580.727096364266, 54673.179902300704, 55435.722821385636, 56811.0, 84264.0, 87333.0, 88251.0, 88777.0, 89200.0, 7575.7878539597, 7796.674565323795, 8199.262066414052, 8283.875741863756, 8477.194666506672, 10958.780824383628, 12955.0, 13074.477020919438, 13335.533256335983, 13445.0, 11091.944540277247, 11169.106471482424, 11290.322580645188, 11442.885571144516, 11479.540818367172, 9780.510974451106, 11178.664640060812, 11449.828252576384, 11480.425978701198, 11555.191136620357, 9515.857262141211, 11265.831012534654, 11325.15061370417, 11529.538818447503, 11680.766384672428, 6644.933550664431, 6805.523613347018, 7255.927440725525, 7278.308560686726, 8212.219839115274, 10115.595376185165, 10889.618863339745, 10900.94549527279, 11052.447377630926, 11199.0], "value": 9438.845506412925, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1515.5907904865683, 1532.9616759581013, 1727.5162954372772, 1822.6810308196063, 1868.962620747585, 8128.634211460484, 8395.580220988957, 8650.956745216274, 9067.501287429188, 9212.953935230324, 8625.95687021564, 8917.68788092417, 8969.282457403408, 8971.730848074569, 8975.281977441806, 2370.288913326004, 2407.109369533275, 2408.771166739166, 2409.77107174819, 2424.163663536086, 2370.6918100646976, 2373.549025685123, 2390.1156572068357, 2415.384077060356, 2419.9879000604974, 2412.3969007748065, 2412.9155479558217, 2419.661247425362, 2425.866577338246, 2429.7205821330595, 2083.718697975769, 2298.321995011467, 2379.7858192762646, 2383.2969274064194, 2387.940301492459, 2391.3423808452812, 2404.987975060131, 2410.602250628644, 2414.6860908081835, 2414.9034038638433, 8906.821863562758, 8969.192772650493, 9037.141471560191, 9040.502772347518, 9078.228350590207, 5284.603654725873, 5312.973435132838, 5377.354717433933, 5475.904819036209, 5478.835634930959, 3624.836882340301, 3629.7822130672243, 3669.9082522936874, 3675.9081022974374, 3682.907927301812, 1082.808910198775, 1082.86464191976, 1088.88022317545, 1097.1223021582703, 1106.004595863721, 11618.95429411357, 11642.941785291105, 11717.121215908755, 11800.173987820855, 11813.350265735382, 4728.71627702339, 4733.5503127202865, 4757.770616597219, 4822.493638168012, 4903.926441103386, 10053.59785608582, 10117.544710488046, 10121.987801219819, 10122.937091605423, 10134.746631334128, 5335.519803217729, 5367.973160134175, 5371.435999220103, 5372.489613486712, 5379.058664733656, 4469.955300447019, 4604.976975115103, 4820.4456487504385, 4874.488178741252, 4959.628027897922, 3977.940330895039, 4028.0, 4072.1041370898356, 4109.856155034559, 4140.482439695038, 1305.4843336882068, 1307.1111644081925, 1313.9540116096082, 1317.80232965056, 1323.1597935310954, 771.8803585444265, 860.9139086091466, 896.9416987895765, 934.3086116273909, 946.6024269806697, 6056.66688332146, 6117.235345581802, 6188.690565471708, 6219.595726277777, 6265.812025639147, 814.9307308878812, 946.8579713043099, 972.9854052189223, 1041.2607048995146, 1046.9528871200814, 3932.6657234134846, 3979.900502487461, 4014.8996275093355, 4066.694997875112, 4103.97948010258, 10591.84112238317, 10971.945140274407, 10977.451127443595, 10987.780244395068, 10987.945060274647, 9003.909960900308, 10773.515191816387, 10815.35107893529, 10836.916308369258, 10876.564937402416, 6681.76613818514, 7878.330341920886, 8125.959370203112, 8186.959065204635, 8288.627011784483, 5761.251037365116, 5960.5231581474245, 6068.0, 6081.27024757032, 6088.726007329592, 10211.897881021094, 10255.94872025635, 10305.021023002802, 10343.379397235889, 10417.270791044553, 9962.950185249027, 10370.844437333295, 10374.481275936323, 10489.160867130764, 10518.053375195963, 7102.644867756489, 7326.0, 7495.625218738932, 7702.691892324245, 7853.725119620786, 7986.480878742863, 8625.8706119407, 8627.784305392164, 8645.91354086451, 8658.523781192094, 7527.360174385239, 7693.88459173124, 7749.186335434923, 7789.0, 7886.487378320391, 7467.3279404851655, 7492.850142997218, 7598.544087354777, 7609.885851712118, 7633.5419874807685, 7036.964815175891, 7155.391791697764, 7171.569705817667, 7176.246494118252, 7183.0, 4972.726500042532, 5036.143855544639, 5062.886165043685, 5138.640295179302, 5217.9478205217465, 5101.642884998015, 5129.281271078438, 5166.483351664803, 5226.216067589892, 5256.4480729524375], "value": 4673.524071747782, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [301.2063213432605, 304.45350595680753, 307.4005688906631, 310.5326483642117, 311.9111053349796, 4909.239067944474, 5470.64440811347, 5536.889262214753, 5551.583631227664, 5627.324721033477, 5008.649394542384, 5390.44230807667, 5435.537979271767, 5448.782048718056, 5540.335159780821, 3951.861684841031, 4078.5309689385654, 4104.486939132594, 4153.777728915031, 4176.45706058212, 4144.606262405066, 4170.353595192735, 4199.874003779876, 4201.600847919458, 4218.3250679891225, 3549.0594992327055, 4066.759638310314, 4159.443675657315, 4186.28833098374, 4213.96594451994, 3378.814165220912, 3463.965360346402, 3627.2745450909792, 3819.560750513671, 4131.35963925592, 3488.5116083748294, 3506.68439840413, 3518.9120271993147, 3528.435450327935, 3552.8223588820715, 4385.868423947287, 5237.554807841338, 5380.24676545284, 5411.675299482044, 5435.0488664483955, 3869.6517313441927, 4320.740755554645, 4549.7042692224895, 4705.223638099709, 4728.905421891577, 4458.286674132123, 4561.657875659305, 5771.711414429262, 5794.0, 5834.737436815311, 3871.380579107329, 3895.8312506248294, 3908.706846986459, 3908.7459315144424, 3929.7249192556533, 5850.688977853766, 5998.380437281953, 6076.453119219292, 6079.179310793031, 6143.32423433422, 3216.195951012247, 3510.1567730138668, 3901.51231096113, 3907.0, 3941.7832019238645, 3420.7092397146025, 3861.517310336208, 4027.536833264212, 4045.8988525287104, 4048.7773172475795, 3727.9440808387894, 4208.537060923357, 4234.894127646772, 4733.0, 4750.311204875274, 5552.944470555323, 5798.188253644493, 5824.970875145682, 5828.358880523139, 5871.119332100219, 1151.3897634253858, 1187.4181650990952, 1364.733876894016, 1371.1156304183746, 1373.450619752107, 749.2544917806708, 784.3685832904566, 836.8577341851778, 837.3008537870825, 842.2714352085402, 4496.955030449653, 4813.219108929648, 4988.351514303117, 5317.787288508416, 5544.63959842609, 5475.780968761205, 5839.357670656224, 6024.909626355608, 6026.397360263939, 6038.788642397495, 4617.653675974316, 4844.947682959712, 5171.9482805171465, 5539.529140023144, 5540.0, 2794.678611959651, 2925.824450532975, 2978.8659510322086, 2999.7300242978235, 3189.952150717741, 5682.602217844794, 6217.533684973645, 6279.843003924847, 6284.183056202664, 6292.968535157295, 5352.0, 5615.691136987505, 5812.680302583399, 5817.76728930838, 6113.205283313141, 5506.724663766876, 5516.724163791714, 6253.155823963707, 6253.249610046823, 6254.436390902274, 4517.706349087299, 4974.602031837372, 5369.677819330853, 5375.274337964324, 5971.134185543159, 5745.1382292656435, 5856.590038697421, 5927.851803704942, 5970.791022314198, 5973.731182096903, 5462.535684466865, 5706.857328566819, 5761.366249712444, 5825.718341964931, 6276.686165691788, 3231.7253033491475, 3292.27569934614, 3412.788460096729, 3935.449037134746, 3940.226897895901, 4759.571638552547, 4971.726555039508, 5393.298871146726, 5498.615096943176, 5991.490723288569, 4284.592963668447, 5067.594592432671, 5427.918581221364, 5703.401142879938, 5866.6186697864505, 4635.212013957703, 5562.972185139049, 5723.513501352431, 5734.251053428744, 5812.041013232938, 4689.976550117228, 5744.524562639543, 5806.216160818235, 5814.953308404528, 5831.950248955229, 5007.198848184419, 5545.972270138624, 5637.238972738628, 5843.6851708365275, 5861.296644402699, 5082.059818933361, 5266.762310856869, 5654.236678048411, 5686.630369026, 5784.248047753765], "value": 4120.7937828711, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [640.2573015302249, 648.9318621544735, 765.2615226306613, 776.9666343762796, 795.5481246724729, 15190.164540950258, 15891.92054039731, 15949.362025518965, 17522.211500482477, 18218.635627287447, 15821.367145314174, 15932.362705491767, 16011.0, 16017.19914004298, 16082.678346433064, 831.6922738586716, 861.9569021548929, 864.6411739128285, 866.8167950747247, 868.1448772958631, 677.3531277629876, 698.6262349642942, 843.1905370843997, 859.188067276424, 860.096898256831, 911.5943405184695, 911.6581282019242, 915.1763412928351, 917.7430319510514, 918.8162367526521, 867.8568036274007, 904.968326108583, 908.4095338030301, 911.9908800911973, 913.5980168725739, 659.831742905556, 661.6989269882192, 666.453508123339, 668.615546061012, 671.6272468779825, 15395.384184632601, 15436.845631543652, 15475.0, 15477.303521341566, 15484.0, 14202.786958195635, 14240.145591264558, 14251.0, 14298.928505357511, 14485.56543303692, 11418.714532136763, 11626.709332266677, 11667.474963626657, 11767.823482647767, 12018.338991355471, 3817.48463957365, 3822.617738226183, 3823.9617603823885, 3945.1123497213184, 3958.267720471722, 123264.0, 123517.38241308735, 124248.37875810562, 124380.37809810984, 124443.37778311051, 10557.894421055844, 10690.30513016667, 10811.567537298577, 10865.967733065347, 11181.105511559055, 20676.689849652266, 20768.169273229203, 20981.055852486676, 20999.16003359879, 21388.57222855565, 7853.175416581291, 7887.921120788718, 8154.469959452616, 8181.631826567819, 8401.025758946642, 4506.301523263899, 4511.097780443924, 4600.677952543289, 4642.156691502692, 4642.442906851199, 3561.465780132949, 3693.0, 3757.28611563802, 3764.171882185915, 3781.1681430085337, 667.8430568816324, 674.2448457727377, 677.3734295776387, 681.5774219983642, 705.108038331511, 505.50460548662517, 614.8893199224093, 679.6669631880343, 681.3969636871404, 687.5084314715003, 8249.29880960125, 9629.470379129216, 9655.0, 9724.805503889882, 9838.458884761263, 649.2760571962323, 669.5012215899186, 670.4870773858003, 690.147667630476, 691.9723211071602, 3913.5303763548554, 4625.1443482955765, 4752.429708434941, 4791.880202994953, 4801.639877009238, 128074.0, 142631.28684356512, 143931.2803435997, 143982.84025739622, 163329.3667063314, 111786.0, 111973.0, 113379.0, 127052.0, 143987.280063599, 92320.0, 96114.51942740381, 108384.37423438655, 109010.0, 109589.0, 9562.856557151508, 9867.161291290033, 9915.702528924145, 10186.949065254626, 10275.177985761271, 60711.0, 61155.69422152861, 63115.42211444751, 63568.364316356245, 63940.3605963953, 76588.61705691436, 85530.0, 86259.0, 91079.54460227657, 96047.55928660936, 12645.747085058063, 12966.870331296943, 13125.278109704059, 13217.867821321664, 13635.386407611482, 14018.509352172625, 14329.426822926966, 14860.554183374516, 15003.174825384272, 15143.772843407138, 12912.677183070498, 13206.405711742802, 14434.350454229374, 14586.0, 14594.0, 13455.0, 13577.0, 13612.183269003892, 13848.446062157402, 14168.0, 13111.475540978254, 13373.0, 13480.932595337354, 13562.660933476742, 13575.38910748999, 10497.265191436527, 10874.441134490666, 11060.008760402774, 11393.544258229578, 11422.086233101498, 10319.864814870509, 11034.944825275823, 11341.886581134084, 11646.126540509325, 11832.763344732884], "value": 7904.808686295133, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1525.8999999999999, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 109.0, 120.0, 119.0, 117.0, 118.0, 121.0, 117.0, 119.0, 100.0], "value": 114.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 125.0, 138.0, 154.0, 111.0, 101.0, 140.0, 141.0, 173.0, 119.0], "value": 133.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [196.0, 198.0, 198.0, 198.0, 196.0, 201.0, 198.0, 193.0, 199.0, 195.0], "value": 197.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 59.0, 58.0, 84.0, 60.0, 58.0, 58.0, 57.0, 74.0, 67.0], "value": 65.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 70.0, 88.0, 73.0, 71.0, 90.0, 112.0, 102.0, 102.0, 106.0], "value": 89.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 87.0, 90.0, 87.0, 93.0, 110.0, 129.0, 88.0, 89.0, 85.0], "value": 94.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 97.0, 98.0, 153.0, 111.0, 135.0, 155.0, 107.0, 152.0, 112.0], "value": 121.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [91.0, 95.0, 115.0, 146.0, 92.0, 91.0, 92.0, 91.0, 93.0, 91.0], "value": 99.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 56.0, 53.0, 56.0, 59.0, 59.0, 60.0, 59.0, 60.0, 60.0], "value": 57.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 77.0, 70.0, 78.0, 77.0, 72.0, 100.0, 61.0, 98.0, 105.0], "value": 80.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 86.0, 84.0, 81.0, 83.0, 81.0, 85.0, 86.0, 82.0, 105.0], "value": 85.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 139.0, 139.0, 136.0, 158.0, 156.0, 166.0, 146.0, 186.0, 168.0], "value": 153.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 167.0, 164.0, 163.0, 166.0, 162.0, 163.0, 165.0, 165.0, 165.0], "value": 164.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 69.0, 68.0, 67.0, 69.0, 67.0, 68.0, 66.0, 68.0, 64.0], "value": 67.6, "unit": "score"}]}]} 03:41:32 INFO - Return code: 0 03:41:32 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:41:32 ERROR - # TBPL SUCCESS # 03:41:32 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:41:32 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:41:32 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:41:32 INFO - 2016-11-07 03:41:32.692 screenresolution[1698:10593] starting screenresolution argv=screenresolution get 03:41:32 INFO - 2016-11-07 03:41:32.694 screenresolution[1698:10593] Display 0: 1600x1200x32@60 03:41:32 INFO - 2016-11-07 03:41:32.700 screenresolution[1699:10596] starting screenresolution argv=screenresolution list 03:41:32 INFO - Available Modes on Display 0 03:41:32 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:41:32 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:41:32 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:41:32 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:41:32 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:41:32 INFO - Intel Iris: 03:41:32 INFO - Chipset Model: Intel Iris 03:41:32 INFO - Type: GPU 03:41:32 INFO - Bus: Built-In 03:41:32 INFO - VRAM (Dynamic, Max): 1536 MB 03:41:32 INFO - Vendor: Intel (0x8086) 03:41:32 INFO - Device ID: 0x0a2e 03:41:32 INFO - Revision ID: 0x0009 03:41:32 INFO - Displays: 03:41:32 INFO - Display: 03:41:32 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:41:32 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:41:32 INFO - Display Serial Number: 1600x1200 60 03:41:32 INFO - Main Display: Yes 03:41:32 INFO - Mirror: Off 03:41:32 INFO - Online: Yes 03:41:32 INFO - Rotation: Supported 03:41:32 INFO - Return code: 0 03:41:32 INFO - Running post-action listener: _resource_record_post_action 03:41:32 INFO - [mozharness: 2016-11-07 11:41:32.923858Z] Finished run-tests step (success) 03:41:32 INFO - Running post-run listener: _resource_record_post_run 03:41:32 INFO - Total resource usage - Wall time: 1208s; CPU: 54.0%; Read bytes: 37479424; Write bytes: 665807872; Read time: 238; Write time: 1904 03:41:32 INFO - TinderboxPrint: CPU usage
54.4% 03:41:32 INFO - TinderboxPrint: I/O read bytes / time
37,479,424 / 238 03:41:32 INFO - TinderboxPrint: I/O write bytes / time
665,807,872 / 1,904 03:41:33 INFO - TinderboxPrint: CPU idle
2,203.6 (45.6%) 03:41:33 INFO - TinderboxPrint: CPU system
981.3 (20.3%) 03:41:33 INFO - TinderboxPrint: CPU user
1,648.7 (34.1%) 03:41:33 INFO - TinderboxPrint: Swap in / out
400,769,024 / 0 03:41:33 INFO - install - Wall time: 33s; CPU: 55.0%; Read bytes: 356592128; Write bytes: 355936256; Read time: 27508; Write time: 708 03:41:33 INFO - run-tests - Wall time: 1176s; CPU: 54.0%; Read bytes: 35689472; Write bytes: 298877952; Read time: 223; Write time: 1160 03:41:33 INFO - Running post-run listener: _upload_blobber_files 03:41:33 INFO - Blob upload gear active. 03:41:33 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:41:33 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 03:41:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:41:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:41:33 INFO - (blobuploader) - INFO - Open directory for files ... 03:41:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 03:41:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:41:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:41:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 03:41:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:41:34 INFO - (blobuploader) - INFO - Done attempting. 03:41:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 03:41:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:41:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:41:35 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 03:41:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:41:35 INFO - (blobuploader) - INFO - Done attempting. 03:41:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:41:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:41:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:41:38 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:41:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:41:38 INFO - (blobuploader) - INFO - Done attempting. 03:41:38 INFO - (blobuploader) - INFO - Iteration through files over. 03:41:38 INFO - Return code: 0 03:41:38 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:41:38 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:41:38 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0ca651afb030ee6628573bd65b4392580e686a48b4f00264ccb5321276c2e791833591cb6d1fd5bdf3fbe22a812eb235c6526586e0271ee9c7c439b5a127b0ad", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a2d6e0f3fb62a2e59ae8710367f06240706adda26b62ae643acfd71570cc586c161d1d3a094bad5fa43073db4f436b16351708117e5d17be8f5b97093ea3cfc5", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/22f259b03abafbec5b6c14e26d2df5bf36d938f90eab5e80306d2f7a1eb85f011ba6f46faf542fc872818dd018a13eb253369e8e2d289ac0d657bcb991ba0442"} 03:41:38 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:41:38 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:41:38 INFO - Contents: 03:41:38 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0ca651afb030ee6628573bd65b4392580e686a48b4f00264ccb5321276c2e791833591cb6d1fd5bdf3fbe22a812eb235c6526586e0271ee9c7c439b5a127b0ad", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a2d6e0f3fb62a2e59ae8710367f06240706adda26b62ae643acfd71570cc586c161d1d3a094bad5fa43073db4f436b16351708117e5d17be8f5b97093ea3cfc5", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/22f259b03abafbec5b6c14e26d2df5bf36d938f90eab5e80306d2f7a1eb85f011ba6f46faf542fc872818dd018a13eb253369e8e2d289ac0d657bcb991ba0442"} 03:41:38 INFO - Running post-run listener: copy_logs_to_upload_dir 03:41:38 INFO - Copying logs to upload dir... 03:41:38 INFO - mkdir: /builds/slave/test/build/upload/logs 03:41:38 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1269.523295 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-11-07 03:41:38.470905) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-07 03:41:38.475185) ========= 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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners TMPDIR=/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0ca651afb030ee6628573bd65b4392580e686a48b4f00264ccb5321276c2e791833591cb6d1fd5bdf3fbe22a812eb235c6526586e0271ee9c7c439b5a127b0ad", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a2d6e0f3fb62a2e59ae8710367f06240706adda26b62ae643acfd71570cc586c161d1d3a094bad5fa43073db4f436b16351708117e5d17be8f5b97093ea3cfc5", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/22f259b03abafbec5b6c14e26d2df5bf36d938f90eab5e80306d2f7a1eb85f011ba6f46faf542fc872818dd018a13eb253369e8e2d289ac0d657bcb991ba0442"} build_url:https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010723 build_url: 'https://queue.taskcluster.net/v1/task/JoLjMhSYRKajVOk_QaCSmg/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0ca651afb030ee6628573bd65b4392580e686a48b4f00264ccb5321276c2e791833591cb6d1fd5bdf3fbe22a812eb235c6526586e0271ee9c7c439b5a127b0ad", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a2d6e0f3fb62a2e59ae8710367f06240706adda26b62ae643acfd71570cc586c161d1d3a094bad5fa43073db4f436b16351708117e5d17be8f5b97093ea3cfc5", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/22f259b03abafbec5b6c14e26d2df5bf36d938f90eab5e80306d2f7a1eb85f011ba6f46faf542fc872818dd018a13eb253369e8e2d289ac0d657bcb991ba0442"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-07 03:41:38.509885) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-07 03:41:38.510203) ========= 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.lvtgSAxOQd/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.MDyoMqXCnU/Listeners TMPDIR=/var/folders/74/b6n0j0694jj3lchy6lrg3v1w00000w/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.005190 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-07 03:41:38.558376) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-07 03:41:38.558675) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-07 03:41:38.561986) ========= ========= Total master_lag: 0.18 =========