builder: mozilla-beta_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0168 starttime: 1490908506.14 results: success (0) buildid: 20170330124805 builduid: a631c646a7994c4b848dadef0374536b revision: fe3e3c0ea489cea724da1bd56ce20fe843d96a9e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:06.138299) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:06.138703) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:06.138974) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:06.168132) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:06.168512) ========= 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.ksArFS0LiB/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.seOdekMOru/Listeners TMPDIR=/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2017-03-30 14:15:06-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 7.29M=0.002s 2017-03-30 14:15:06 (7.29 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.128802 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:06.320433) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:06.320740) ========= 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.ksArFS0LiB/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.seOdekMOru/Listeners TMPDIR=/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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.021126 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:06.369229) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-30 14:15:06.369626) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev fe3e3c0ea489cea724da1bd56ce20fe843d96a9e --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev fe3e3c0ea489cea724da1bd56ce20fe843d96a9e --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ksArFS0LiB/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.seOdekMOru/Listeners TMPDIR=/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2017-03-30 14:15:06,452 truncating revision to first 12 chars 2017-03-30 14:15:06,452 Setting DEBUG logging. 2017-03-30 14:15:06,452 attempt 1/10 2017-03-30 14:15:06,452 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/fe3e3c0ea489?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-30 14:15:07,358 unpacking tar archive at: mozilla-beta-fe3e3c0ea489/testing/mozharness/ program finished with exit code 0 elapsedTime=1.167649 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-30 14:15:07.560546) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:07.560866) ========= script_repo_revision: fe3e3c0ea489cea724da1bd56ce20fe843d96a9e ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:07.561243) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:07.561520) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-30 14:15:07.581143) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2017-03-30 14:15:07.581513) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ksArFS0LiB/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.seOdekMOru/Listeners TMPDIR=/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:07 INFO - MultiFileLogger online at 20170330 14:15:07 in /builds/slave/test 14:15:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 14:15:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 14:15:07 INFO - {'append_to_log': False, 14:15:07 INFO - 'base_work_dir': '/builds/slave/test', 14:15:07 INFO - 'blob_upload_branch': 'Mozilla-Beta', 14:15:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 14:15:07 INFO - 'branch': 'Mozilla-Beta', 14:15:07 INFO - 'buildbot_json_path': 'buildprops.json', 14:15:07 INFO - 'config_files': ('talos/mac_config.py',), 14:15:07 INFO - 'default_actions': ('clobber', 14:15:07 INFO - 'read-buildbot-config', 14:15:07 INFO - 'download-and-extract', 14:15:07 INFO - 'populate-webroot', 14:15:07 INFO - 'create-virtualenv', 14:15:07 INFO - 'install', 14:15:07 INFO - 'run-tests'), 14:15:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 14:15:07 INFO - 'download_minidump_stackwalk': True, 14:15:07 INFO - 'download_symbols': 'ondemand', 14:15:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 14:15:07 INFO - 'tooltool.py': '/tools/tooltool.py', 14:15:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 14:15:07 INFO - '/tools/misc-python/virtualenv.py')}, 14:15:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 14:15:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 14:15:07 INFO - 'installer_path': 'installer.exe', 14:15:07 INFO - 'log_level': 'info', 14:15:07 INFO - 'log_name': 'talos', 14:15:07 INFO - 'log_to_console': True, 14:15:07 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 14:15:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 14:15:07 INFO - 'opt_config_files': (), 14:15:07 INFO - 'pip_index': False, 14:15:07 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 14:15:07 INFO - 'cmd': ('bash', 14:15:07 INFO - '-c', 14:15:07 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 14:15:07 INFO - 'enabled': True, 14:15:07 INFO - 'halt_on_failure': False, 14:15:07 INFO - 'name': 'check_screen_resolution'},), 14:15:07 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 14:15:07 INFO - 'cmd': ('bash', 14:15:07 INFO - '-c', 14:15:07 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 14:15:07 INFO - 'enabled': True, 14:15:07 INFO - 'halt_on_failure': False, 14:15:07 INFO - 'name': 'check_screen_resolution'},), 14:15:07 INFO - 'run_cmd_checks_enabled': True, 14:15:07 INFO - 'sps_profile': False, 14:15:07 INFO - 'sps_profile_interval': 0, 14:15:07 INFO - 'suite': 'dromaeojs-e10s', 14:15:07 INFO - 'system_bits': '32', 14:15:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 14:15:07 INFO - 'title': 't-yosemite-r7-0168', 14:15:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 14:15:07 INFO - 'use_talos_json': True, 14:15:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 14:15:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 14:15:07 INFO - 'work_dir': 'build'} 14:15:07 INFO - [mozharness: 2017-03-30 21:15:07.792515Z] Running clobber step. 14:15:07 INFO - Running pre-action listener: _resource_record_pre_action 14:15:07 INFO - Running main action method: clobber 14:15:07 INFO - rmtree: /builds/slave/test/build 14:15:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 14:15:09 INFO - Running post-action listener: _resource_record_post_action 14:15:09 INFO - [mozharness: 2017-03-30 21:15:09.845892Z] Finished clobber step (success) 14:15:09 INFO - [mozharness: 2017-03-30 21:15:09.846045Z] Running read-buildbot-config step. 14:15:09 INFO - Running pre-action listener: _resource_record_pre_action 14:15:09 INFO - Running main action method: read_buildbot_config 14:15:09 INFO - Using buildbot properties: 14:15:09 INFO - { 14:15:09 INFO - "project": "", 14:15:09 INFO - "product": "firefox", 14:15:09 INFO - "script_repo_revision": "production", 14:15:09 INFO - "builddir": "mozilla-beta_yosemite_r7_test-dromaeojs-e10s", 14:15:09 INFO - "repository": "", 14:15:09 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-beta talos dromaeojs-e10s", 14:15:09 INFO - "buildid": "20170330124805", 14:15:09 INFO - "pgo_build": "False", 14:15:09 INFO - "basedir": "/builds/slave/test", 14:15:09 INFO - "buildnumber": 17, 14:15:09 INFO - "slavename": "t-yosemite-r7-0168", 14:15:09 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 14:15:09 INFO - "platform": "yosemite_r7", 14:15:09 INFO - "scheduler": "tests-mozilla-beta-macosx64-talos", 14:15:09 INFO - "branch": "mozilla-beta", 14:15:09 INFO - "repo_path": "releases/mozilla-beta", 14:15:09 INFO - "revision": "fe3e3c0ea489cea724da1bd56ce20fe843d96a9e", 14:15:09 INFO - "stage_platform": "macosx64", 14:15:09 INFO - "builduid": "a631c646a7994c4b848dadef0374536b", 14:15:09 INFO - "slavebuilddir": "test" 14:15:09 INFO - } 14:15:09 INFO - Found installer url https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.dmg. 14:15:09 INFO - Running post-action listener: _resource_record_post_action 14:15:09 INFO - [mozharness: 2017-03-30 21:15:09.849493Z] Finished read-buildbot-config step (success) 14:15:09 INFO - [mozharness: 2017-03-30 21:15:09.849594Z] Running download-and-extract step. 14:15:09 INFO - Running pre-action listener: _resource_record_pre_action 14:15:09 INFO - Running main action method: download_and_extract 14:15:09 INFO - mkdir: /builds/slave/test/build/tests 14:15:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:09 INFO - trying https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.test_packages.json 14:15:09 INFO - Downloading https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-53.0.en-US.mac.test_packages.json 14:15:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-53.0.en-US.mac.test_packages.json'}, attempt #1 14:15:10 INFO - Downloaded 1165 bytes. 14:15:10 INFO - Reading from file /builds/slave/test/build/firefox-53.0.en-US.mac.test_packages.json 14:15:10 INFO - Using the following test package requirements: 14:15:10 INFO - {u'common': [u'firefox-53.0.en-US.mac.common.tests.zip'], 14:15:10 INFO - u'cppunittest': [u'firefox-53.0.en-US.mac.common.tests.zip', 14:15:10 INFO - u'firefox-53.0.en-US.mac.cppunittest.tests.zip'], 14:15:10 INFO - u'gtest': [u'firefox-53.0.en-US.mac.common.tests.zip', 14:15:10 INFO - u'firefox-53.0.en-US.mac.gtest.tests.zip'], 14:15:10 INFO - u'jittest': [u'firefox-53.0.en-US.mac.common.tests.zip', u'jsshell-mac.zip'], 14:15:10 INFO - u'mochitest': [u'firefox-53.0.en-US.mac.common.tests.zip', 14:15:10 INFO - u'firefox-53.0.en-US.mac.mochitest.tests.zip'], 14:15:10 INFO - u'mozbase': [u'firefox-53.0.en-US.mac.common.tests.zip'], 14:15:10 INFO - u'reftest': [u'firefox-53.0.en-US.mac.common.tests.zip', 14:15:10 INFO - u'firefox-53.0.en-US.mac.reftest.tests.zip'], 14:15:10 INFO - u'talos': [u'firefox-53.0.en-US.mac.common.tests.zip', 14:15:10 INFO - u'firefox-53.0.en-US.mac.talos.tests.zip'], 14:15:10 INFO - u'web-platform': [u'firefox-53.0.en-US.mac.common.tests.zip', 14:15:10 INFO - u'firefox-53.0.en-US.mac.web-platform.tests.zip'], 14:15:10 INFO - u'xpcshell': [u'firefox-53.0.en-US.mac.common.tests.zip', 14:15:10 INFO - u'firefox-53.0.en-US.mac.xpcshell.tests.zip']} 14:15:10 INFO - Downloading packages: [u'firefox-53.0.en-US.mac.common.tests.zip'] for test suite category: common 14:15:10 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip 14:15:10 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip'}, attempt #1 14:15:10 INFO - Fetch https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip into memory 14:15:11 INFO - Expected file size: 16108843 14:15:11 INFO - Obtained file size: 16108843 14:15:18 INFO - Downloading packages: [u'firefox-53.0.en-US.mac.common.tests.zip', u'firefox-53.0.en-US.mac.talos.tests.zip'] for test suite category: talos 14:15:18 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip 14:15:18 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip'}, attempt #1 14:15:18 INFO - Fetch https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.common.tests.zip into memory 14:15:19 INFO - Expected file size: 16108843 14:15:19 INFO - Obtained file size: 16108843 14:15:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.talos.tests.zip 14:15:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.talos.tests.zip'}, attempt #1 14:15:25 INFO - Fetch https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.talos.tests.zip into memory 14:15:26 INFO - Expected file size: 14403663 14:15:26 INFO - Obtained file size: 14403663 14:15:26 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')]} 14:15:26 INFO - trying https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.dmg 14:15:26 INFO - Downloading https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.dmg to /builds/slave/test/build/firefox-53.0.en-US.mac.dmg 14:15:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-53.0.en-US.mac.dmg'}, attempt #1 14:15:28 INFO - Downloaded 58691563 bytes. 14:15:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.dmg 14:15:28 INFO - mkdir: /builds/slave/test/properties 14:15:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 14:15:28 INFO - Writing to file /builds/slave/test/properties/build_url 14:15:28 INFO - Contents: 14:15:28 INFO - build_url:https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.dmg 14:15:29 INFO - Running post-action listener: _resource_record_post_action 14:15:29 INFO - Running post-action listener: set_extra_try_arguments 14:15:29 INFO - [mozharness: 2017-03-30 21:15:29.291434Z] Finished download-and-extract step (success) 14:15:29 INFO - [mozharness: 2017-03-30 21:15:29.291586Z] Running populate-webroot step. 14:15:29 INFO - Running pre-action listener: _resource_record_pre_action 14:15:29 INFO - Running main action method: populate_webroot 14:15:29 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 14:15:29 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 14:15:29 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 14:15:29 INFO - '--tppagecycles', 14:15:29 INFO - '7'], 14:15:29 INFO - 'tests': ['tsvgm']}}, 14:15:29 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['tresize', 'tcanvasmark']}, 14:15:29 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 14:15:29 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['dromaeo_css', 'kraken']}, 14:15:29 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 14:15:29 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 14:15:29 INFO - 'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:15:29 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 14:15:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:15:29 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 14:15:29 INFO - 'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['damp', 'tps']}, 14:15:29 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 14:15:29 INFO - 'tests': ['damp', 'tps']}, 14:15:29 INFO - 'g3': {'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['dromaeo_dom']}, 14:15:29 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 14:15:29 INFO - 'g4': {'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['basic_compositor_video']}, 14:15:29 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 14:15:29 INFO - 'other': {'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['a11yr', 14:15:29 INFO - 'ts_paint', 14:15:29 INFO - 'tpaint', 14:15:29 INFO - 'sessionrestore', 14:15:29 INFO - 'sessionrestore_no_auto_restore', 14:15:29 INFO - 'tabpaint']}, 14:15:29 INFO - 'other-e10s': {'tests': ['a11yr', 14:15:29 INFO - 'ts_paint', 14:15:29 INFO - 'tpaint', 14:15:29 INFO - 'sessionrestore', 14:15:29 INFO - 'sessionrestore_no_auto_restore', 14:15:29 INFO - 'tabpaint']}, 14:15:29 INFO - 'other-e10s_l64': {'tests': ['a11yr', 14:15:29 INFO - 'ts_paint', 14:15:29 INFO - 'tpaint', 14:15:29 INFO - 'sessionrestore', 14:15:29 INFO - 'sessionrestore_no_auto_restore', 14:15:29 INFO - 'tabpaint']}, 14:15:29 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 14:15:29 INFO - 'ts_paint', 14:15:29 INFO - 'tpaint', 14:15:29 INFO - 'sessionrestore', 14:15:29 INFO - 'sessionrestore_no_auto_restore', 14:15:29 INFO - 'tabpaint']}, 14:15:29 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['a11yr', 14:15:29 INFO - 'ts_paint', 14:15:29 INFO - 'tpaint', 14:15:29 INFO - 'sessionrestore', 14:15:29 INFO - 'sessionrestore_no_auto_restore', 14:15:29 INFO - 'tabpaint']}, 14:15:29 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['a11yr', 14:15:29 INFO - 'ts_paint', 14:15:29 INFO - 'tpaint', 14:15:29 INFO - 'sessionrestore', 14:15:29 INFO - 'sessionrestore_no_auto_restore', 14:15:29 INFO - 'tabpaint']}, 14:15:29 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['tsvgx', 14:15:29 INFO - 'tsvgr_opacity', 14:15:29 INFO - 'tart', 14:15:29 INFO - 'tscrollx', 14:15:29 INFO - 'cart', 14:15:29 INFO - 'tsvg_static']}, 14:15:29 INFO - 'svgr-e10s': {'tests': ['tsvgx', 14:15:29 INFO - 'tsvgr_opacity', 14:15:29 INFO - 'tart', 14:15:29 INFO - 'tscrollx', 14:15:29 INFO - 'cart', 14:15:29 INFO - 'tsvg_static']}, 14:15:29 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 14:15:29 INFO - 'talos_options': ['--disable-e10s'], 14:15:29 INFO - 'tests': ['tp5o']}, 14:15:29 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 14:15:29 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 14:15:29 INFO - 'talos_options': ['--disable-e10s', 14:15:29 INFO - '--xperf_path', 14:15:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:15:29 INFO - 'tests': ['tp5n']}, 14:15:29 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 14:15:29 INFO - 'talos_options': ['--xperf_path', 14:15:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:15:29 INFO - 'tests': ['tp5n']}}, 14:15:29 INFO - 'talos.zip': {'path': '', 14:15:29 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 14:15:29 INFO - Running post-action listener: _resource_record_post_action 14:15:29 INFO - [mozharness: 2017-03-30 21:15:29.310069Z] Finished populate-webroot step (success) 14:15:29 INFO - [mozharness: 2017-03-30 21:15:29.310208Z] Running create-virtualenv step. 14:15:29 INFO - Running pre-action listener: _resource_record_pre_action 14:15:29 INFO - Running main action method: create_virtualenv 14:15:29 INFO - Creating virtualenv /builds/slave/test/build/venv 14:15:29 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 14:15:29 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 14:15:29 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 14:15:29 INFO - Using real prefix '/tools/python27' 14:15:29 INFO - New python executable in /builds/slave/test/build/venv/bin/python 14:15:30 INFO - Installing distribute.............................................................................................................................................................................................done. 14:15:32 INFO - Installing pip.................done. 14:15:32 INFO - Return code: 0 14:15:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 14:15:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 14:15:33 INFO - Reading from file tmpfile_stdout 14:15:33 INFO - Output received: 14:15:33 INFO - pip 1.5.5 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 14:15:33 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 14:15:33 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')]} 14:15:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:15:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:33 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')]} 14:15:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:15:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:33 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 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:33 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 14:15:33 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 14:15:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:15:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:15:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:15:33 INFO - 'HOME': '/Users/cltbld', 14:15:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:15:33 INFO - 'LOGNAME': 'cltbld', 14:15:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:15:33 INFO - 'MOZ_NO_REMOTE': '1', 14:15:33 INFO - 'NO_EM_RESTART': '1', 14:15:33 INFO - 'PAGER': '/bin/cat', 14:15:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:15:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:15:33 INFO - 'PWD': '/builds/slave/test', 14:15:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:15:33 INFO - 'SHELL': '/bin/bash', 14:15:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:15:33 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:15:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:15:33 INFO - 'USER': 'cltbld', 14:15:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:15:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:15:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:15:33 INFO - 'XPC_FLAGS': '0x0', 14:15:33 INFO - 'XPC_SERVICE_NAME': '0', 14:15:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:15:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:15:33 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 14:15:33 INFO - Cleaning up... 14:15:33 INFO - Return code: 0 14:15:33 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 14:15:33 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')]} 14:15:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:15:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:33 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')]} 14:15:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:15:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:33 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 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:33 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 14:15:33 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 14:15:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:15:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:15:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:15:33 INFO - 'HOME': '/Users/cltbld', 14:15:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:15:33 INFO - 'LOGNAME': 'cltbld', 14:15:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:15:33 INFO - 'MOZ_NO_REMOTE': '1', 14:15:33 INFO - 'NO_EM_RESTART': '1', 14:15:33 INFO - 'PAGER': '/bin/cat', 14:15:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:15:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:15:33 INFO - 'PWD': '/builds/slave/test', 14:15:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:15:33 INFO - 'SHELL': '/bin/bash', 14:15:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:15:33 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:15:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:15:33 INFO - 'USER': 'cltbld', 14:15:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:15:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:15:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:15:33 INFO - 'XPC_FLAGS': '0x0', 14:15:33 INFO - 'XPC_SERVICE_NAME': '0', 14:15:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:15:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:15:33 INFO - Downloading/unpacking psutil>=3.1.1 14:15:33 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 14:15:33 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 14:15:33 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 14:15:33 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 14:15:33 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 14:15:33 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 14:15:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 14:15:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:15:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:15:37 INFO - Installing collected packages: psutil 14:15:37 INFO - Running setup.py install for psutil 14:15:37 INFO - building 'psutil._psutil_osx' extension 14:15:37 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 14:15:37 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 14:15:37 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 14:15:37 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 14:15:37 INFO - building 'psutil._psutil_posix' extension 14:15:37 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 14:15:37 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 14:15:37 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 14:15:37 INFO - ^ 14:15:37 INFO - 1 warning generated. 14:15:37 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 14:15:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:15:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:15:38 INFO - Successfully installed psutil 14:15:38 INFO - Cleaning up... 14:15:38 INFO - Return code: 0 14:15:38 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 14:15:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:15:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:15:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:38 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 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:38 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 14:15:38 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 14:15:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:15:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:15:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:15:38 INFO - 'HOME': '/Users/cltbld', 14:15:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:15:38 INFO - 'LOGNAME': 'cltbld', 14:15:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:15:38 INFO - 'MOZ_NO_REMOTE': '1', 14:15:38 INFO - 'NO_EM_RESTART': '1', 14:15:38 INFO - 'PAGER': '/bin/cat', 14:15:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:15:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:15:38 INFO - 'PWD': '/builds/slave/test', 14:15:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:15:38 INFO - 'SHELL': '/bin/bash', 14:15:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:15:38 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:15:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:15:38 INFO - 'USER': 'cltbld', 14:15:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:15:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:15:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:15:38 INFO - 'XPC_FLAGS': '0x0', 14:15:38 INFO - 'XPC_SERVICE_NAME': '0', 14:15:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:15:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:15:38 INFO - Downloading/unpacking mozsystemmonitor==0.3 14:15:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:15:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:15:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:15:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:15:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:15:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:15:41 INFO - Downloading mozsystemmonitor-0.3.tar.gz 14:15:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 14:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 14:15:41 INFO - Installing collected packages: mozsystemmonitor 14:15:41 INFO - Running setup.py install for mozsystemmonitor 14:15:41 INFO - Successfully installed mozsystemmonitor 14:15:41 INFO - Cleaning up... 14:15:41 INFO - Return code: 0 14:15:41 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 14:15:41 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')]} 14:15:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:15:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:41 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')]} 14:15:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:15:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:41 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 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:41 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 14:15:41 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 14:15:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:15:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:15:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:15:41 INFO - 'HOME': '/Users/cltbld', 14:15:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:15:41 INFO - 'LOGNAME': 'cltbld', 14:15:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:15:41 INFO - 'MOZ_NO_REMOTE': '1', 14:15:41 INFO - 'NO_EM_RESTART': '1', 14:15:41 INFO - 'PAGER': '/bin/cat', 14:15:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:15:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:15:41 INFO - 'PWD': '/builds/slave/test', 14:15:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:15:41 INFO - 'SHELL': '/bin/bash', 14:15:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:15:41 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:15:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:15:41 INFO - 'USER': 'cltbld', 14:15:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:15:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:15:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:15:41 INFO - 'XPC_FLAGS': '0x0', 14:15:41 INFO - 'XPC_SERVICE_NAME': '0', 14:15:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:15:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:15:41 INFO - Downloading/unpacking jsonschema==2.5.1 14:15:41 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 14:15:41 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 14:15:41 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 14:15:41 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 14:15:41 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 14:15:41 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 14:15:44 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 14:15:44 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 14:15:44 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 14:15:44 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 14:15:44 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 14:15:44 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 14:15:44 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 14:15:44 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 14:15:44 INFO - Downloading functools32-3.2.3-2.tar.gz 14:15:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 14:15:44 INFO - warning: no files found matching '*.txt' 14:15:44 INFO - no previously-included directories found matching 'build' 14:15:44 INFO - no previously-included directories found matching 'dist' 14:15:44 INFO - no previously-included directories found matching '.git*' 14:15:44 INFO - Installing collected packages: jsonschema, functools32 14:15:44 INFO - Running setup.py install for functools32 14:15:44 INFO - warning: no files found matching '*.txt' 14:15:44 INFO - no previously-included directories found matching 'build' 14:15:44 INFO - no previously-included directories found matching 'dist' 14:15:44 INFO - no previously-included directories found matching '.git*' 14:15:44 INFO - Successfully installed jsonschema functools32 14:15:44 INFO - Cleaning up... 14:15:45 INFO - Return code: 0 14:15:45 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 14:15:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:15:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:15:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:45 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 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:45 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 14:15:45 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 14:15:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:15:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:15:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:15:45 INFO - 'HOME': '/Users/cltbld', 14:15:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:15:45 INFO - 'LOGNAME': 'cltbld', 14:15:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:15:45 INFO - 'MOZ_NO_REMOTE': '1', 14:15:45 INFO - 'NO_EM_RESTART': '1', 14:15:45 INFO - 'PAGER': '/bin/cat', 14:15:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:15:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:15:45 INFO - 'PWD': '/builds/slave/test', 14:15:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:15:45 INFO - 'SHELL': '/bin/bash', 14:15:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:15:45 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:15:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:15:45 INFO - 'USER': 'cltbld', 14:15:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:15:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:15:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:15:45 INFO - 'XPC_FLAGS': '0x0', 14:15:45 INFO - 'XPC_SERVICE_NAME': '0', 14:15:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:15:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:15:45 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 14:15:45 INFO - Cleaning up... 14:15:45 INFO - Return code: 0 14:15:45 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 14:15:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:15:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:15:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:45 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 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:45 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 14:15:45 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 14:15:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:15:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:15:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:15:45 INFO - 'HOME': '/Users/cltbld', 14:15:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:15:45 INFO - 'LOGNAME': 'cltbld', 14:15:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:15:45 INFO - 'MOZ_NO_REMOTE': '1', 14:15:45 INFO - 'NO_EM_RESTART': '1', 14:15:45 INFO - 'PAGER': '/bin/cat', 14:15:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:15:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:15:45 INFO - 'PWD': '/builds/slave/test', 14:15:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:15:45 INFO - 'SHELL': '/bin/bash', 14:15:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:15:45 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:15:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:15:45 INFO - 'USER': 'cltbld', 14:15:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:15:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:15:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:15:45 INFO - 'XPC_FLAGS': '0x0', 14:15:45 INFO - 'XPC_SERVICE_NAME': '0', 14:15:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:15:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:15:45 INFO - Downloading/unpacking blobuploader==1.2.4 14:15:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:15:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:15:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:15:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:15:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:15:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:15:48 INFO - Downloading blobuploader-1.2.4.tar.gz 14:15:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 14:15:48 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 14:15:48 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 14:15:48 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 14:15:48 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 14:15:48 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 14:15:48 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 14:15:48 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 14:15:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 14:15:48 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 14:15:48 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 14:15:48 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 14:15:48 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 14:15:48 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 14:15:48 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 14:15:48 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 14:15:49 INFO - Downloading docopt-0.6.1.tar.gz 14:15:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 14:15:49 INFO - Installing collected packages: blobuploader, requests, docopt 14:15:49 INFO - Running setup.py install for blobuploader 14:15:49 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 14:15:49 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 14:15:49 INFO - Running setup.py install for requests 14:15:50 INFO - Running setup.py install for docopt 14:15:50 INFO - Successfully installed blobuploader requests docopt 14:15:50 INFO - Cleaning up... 14:15:50 INFO - Return code: 0 14:15:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:15:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:15:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:15:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:50 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 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:50 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 14:15:50 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 14:15:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:15:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:15:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:15:50 INFO - 'HOME': '/Users/cltbld', 14:15:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:15:50 INFO - 'LOGNAME': 'cltbld', 14:15:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:15:50 INFO - 'MOZ_NO_REMOTE': '1', 14:15:50 INFO - 'NO_EM_RESTART': '1', 14:15:50 INFO - 'PAGER': '/bin/cat', 14:15:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:15:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:15:50 INFO - 'PWD': '/builds/slave/test', 14:15:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:15:50 INFO - 'SHELL': '/bin/bash', 14:15:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:15:50 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:15:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:15:50 INFO - 'USER': 'cltbld', 14:15:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:15:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:15:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:15:50 INFO - 'XPC_FLAGS': '0x0', 14:15:50 INFO - 'XPC_SERVICE_NAME': '0', 14:15:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:15:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:15:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:15:50 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-Y2ULzb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:15:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:15:50 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-zxcLt9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:15:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:15:50 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-TOXG8U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-suNuaU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-4fDpvf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-XMT1px-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-IuX_K1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-UQlL35-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-pbz7bi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-yZT9ly-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-6uDN1T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-lRN6gN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:15:51 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-FKMLR_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:15:52 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-Nlu4Da-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:15:52 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-0XPYW9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:15:52 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-zEF1vq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:15:52 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-a0iOxf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:15:52 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 14:15:52 INFO - Running setup.py install for manifestparser 14:15:52 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 14:15:52 INFO - Running setup.py install for mozcrash 14:15:52 INFO - Running setup.py install for mozdebug 14:15:52 INFO - Running setup.py install for mozdevice 14:15:53 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Installing dm script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Running setup.py install for mozfile 14:15:53 INFO - Running setup.py install for mozhttpd 14:15:53 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Running setup.py install for mozinfo 14:15:53 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Running setup.py install for mozInstall 14:15:53 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Running setup.py install for mozleak 14:15:53 INFO - Running setup.py install for mozlog 14:15:53 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 14:15:53 INFO - Running setup.py install for moznetwork 14:15:54 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 14:15:54 INFO - Running setup.py install for mozprocess 14:15:54 INFO - Running setup.py install for mozprofile 14:15:54 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 14:15:54 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 14:15:54 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 14:15:54 INFO - Running setup.py install for mozrunner 14:15:54 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 14:15:54 INFO - Running setup.py install for mozscreenshot 14:15:54 INFO - Running setup.py install for moztest 14:15:54 INFO - Running setup.py install for mozversion 14:15:55 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 14:15:55 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 14:15:55 INFO - Cleaning up... 14:15:55 INFO - Return code: 0 14:15:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:15:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:15:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:15:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:15:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:15:55 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:15:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 14:15:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 14:15:55 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:15:55 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:15:55 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:15:55 INFO - 'HOME': '/Users/cltbld', 14:15:55 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:15:55 INFO - 'LOGNAME': 'cltbld', 14:15:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:15:55 INFO - 'MOZ_NO_REMOTE': '1', 14:15:55 INFO - 'NO_EM_RESTART': '1', 14:15:55 INFO - 'PAGER': '/bin/cat', 14:15:55 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:15:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:15:55 INFO - 'PWD': '/builds/slave/test', 14:15:55 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:15:55 INFO - 'SHELL': '/bin/bash', 14:15:55 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:15:55 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:15:55 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:15:55 INFO - 'USER': 'cltbld', 14:15:55 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:15:55 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:15:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:15:55 INFO - 'XPC_FLAGS': '0x0', 14:15:55 INFO - 'XPC_SERVICE_NAME': '0', 14:15:55 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:15:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:15:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:15:55 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-FHc62v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:15:55 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)) 14:15:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:15:55 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-1_Jf2b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:15:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:15:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:15:55 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-MOH4QU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:15:55 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)) 14:15:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:15:55 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-xjYt4R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:15:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 14:15:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:15:55 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-DPzuav-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:15:55 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)) 14:15:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:15:55 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-eVZRwY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:15:55 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)) 14:15:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:15:55 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-PbF172-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:15:56 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)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-34XdNh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:15:56 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)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-4Odfts-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:15:56 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)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-DIduWL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:15:56 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)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-ISbAOX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:15:56 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)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-pZvCnC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:15:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-H7VddH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:15:56 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)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-xtzTfl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:15:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-iQWj0p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:15:56 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)) 14:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:15:56 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-Sl7OjI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 14:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:15:57 INFO - Running setup.py (path:/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/pip-_CMKfG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:15:57 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)) 14:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 14:15:57 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)) 14:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 14:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 14:15:57 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 14:15:57 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 14:15:57 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 14:15:57 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 14:15:57 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 14:15:57 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 14:15:57 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 14:15:59 INFO - Downloading blessings-1.6.tar.gz 14:15:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 14:15:59 INFO - Installing collected packages: blessings 14:15:59 INFO - Running setup.py install for blessings 14:15:59 INFO - Successfully installed blessings 14:15:59 INFO - Cleaning up... 14:16:00 INFO - Return code: 0 14:16:00 INFO - Done creating virtualenv /builds/slave/test/build/venv. 14:16:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:16:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:16:00 INFO - Reading from file tmpfile_stdout 14:16:00 INFO - Current package versions: 14:16:00 INFO - blessings == 1.6 14:16:00 INFO - blobuploader == 1.2.4 14:16:00 INFO - docopt == 0.6.1 14:16:00 INFO - functools32 == 3.2.3-2 14:16:00 INFO - jsonschema == 2.5.1 14:16:00 INFO - manifestparser == 1.1 14:16:00 INFO - mozInstall == 1.12 14:16:00 INFO - mozcrash == 1.0 14:16:00 INFO - mozdebug == 0.1 14:16:00 INFO - mozdevice == 0.49 14:16:00 INFO - mozfile == 1.2 14:16:00 INFO - mozhttpd == 0.7 14:16:00 INFO - mozinfo == 0.9 14:16:00 INFO - mozleak == 0.1 14:16:00 INFO - mozlog == 3.4 14:16:00 INFO - moznetwork == 0.27 14:16:00 INFO - mozprocess == 0.24 14:16:00 INFO - mozprofile == 0.28 14:16:00 INFO - mozrunner == 6.13 14:16:00 INFO - mozscreenshot == 0.1 14:16:00 INFO - mozsystemmonitor == 0.3 14:16:00 INFO - moztest == 0.8 14:16:00 INFO - mozversion == 1.4 14:16:00 INFO - psutil == 3.1.1 14:16:00 INFO - requests == 1.2.3 14:16:00 INFO - wsgiref == 0.1.2 14:16:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:16:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:16:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:16:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:16:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:16:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:16:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:16:00 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 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:16:00 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 14:16:00 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 14:16:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:16:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:16:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:16:00 INFO - 'HOME': '/Users/cltbld', 14:16:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:16:00 INFO - 'LOGNAME': 'cltbld', 14:16:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:16:00 INFO - 'MOZ_NO_REMOTE': '1', 14:16:00 INFO - 'NO_EM_RESTART': '1', 14:16:00 INFO - 'PAGER': '/bin/cat', 14:16:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:16:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:16:00 INFO - 'PWD': '/builds/slave/test', 14:16:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:16:00 INFO - 'SHELL': '/bin/bash', 14:16:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:16:00 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:16:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:16:00 INFO - 'USER': 'cltbld', 14:16:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:16:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:16:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:16:00 INFO - 'XPC_FLAGS': '0x0', 14:16:00 INFO - 'XPC_SERVICE_NAME': '0', 14:16:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:16:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 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)) 14:16:00 INFO - Cleaning up... 14:16:00 INFO - Return code: 0 14:16:00 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 14:16:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:16:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:16:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:16:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 14:16:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:16:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:16:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102c0eb70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102c11768>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe63b461fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, '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.ksArFS0LiB/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.seOdekMOru/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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 14:16:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 14:16:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 14:16:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:16:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:16:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:16:00 INFO - 'HOME': '/Users/cltbld', 14:16:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:16:00 INFO - 'LOGNAME': 'cltbld', 14:16:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:16:00 INFO - 'MOZ_NO_REMOTE': '1', 14:16:00 INFO - 'NO_EM_RESTART': '1', 14:16:00 INFO - 'PAGER': '/bin/cat', 14:16:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:16:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:16:00 INFO - 'PWD': '/builds/slave/test', 14:16:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:16:00 INFO - 'SHELL': '/bin/bash', 14:16:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:16:00 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:16:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:16:00 INFO - 'USER': 'cltbld', 14:16:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:16:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:16:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:16:00 INFO - 'XPC_FLAGS': '0x0', 14:16:00 INFO - 'XPC_SERVICE_NAME': '0', 14:16:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:16:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:16:00 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 14:16:00 INFO - Cleaning up... 14:16:00 INFO - Return code: 0 14:16:00 INFO - Running post-action listener: _resource_record_post_action 14:16:00 INFO - Running post-action listener: _start_resource_monitoring 14:16:00 INFO - Starting resource monitoring. 14:16:00 INFO - [mozharness: 2017-03-30 21:16:00.888123Z] Finished create-virtualenv step (success) 14:16:00 INFO - [mozharness: 2017-03-30 21:16:00.889090Z] Running install step. 14:16:00 INFO - Running pre-action listener: _resource_record_pre_action 14:16:00 INFO - Running main action method: install 14:16:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:16:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:16:01 INFO - Reading from file tmpfile_stdout 14:16:01 INFO - Detecting whether we're running mozinstall >=1.0... 14:16:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 14:16:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 14:16:01 INFO - Reading from file tmpfile_stdout 14:16:01 INFO - Output received: 14:16:01 INFO - Usage: mozinstall [options] installer 14:16:01 INFO - Options: 14:16:01 INFO - -h, --help show this help message and exit 14:16:01 INFO - -d DEST, --destination=DEST 14:16:01 INFO - Directory to install application into. [default: 14:16:01 INFO - "/builds/slave/test"] 14:16:01 INFO - --app=APP Application being installed. [default: firefox] 14:16:01 INFO - mkdir: /builds/slave/test/build/application 14:16:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-53.0.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 14:16:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-53.0.en-US.mac.dmg --destination /builds/slave/test/build/application 14:16:16 INFO - Reading from file tmpfile_stdout 14:16:16 INFO - Output received: 14:16:16 INFO - /builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox 14:16:16 INFO - Running post-action listener: _resource_record_post_action 14:16:16 INFO - [mozharness: 2017-03-30 21:16:16.370907Z] Finished install step (success) 14:16:16 INFO - [mozharness: 2017-03-30 21:16:16.371062Z] Running run-tests step. 14:16:16 INFO - Running pre-action listener: _resource_record_pre_action 14:16:16 INFO - Running main action method: run_tests 14:16:16 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 14:16:16 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 14:16:16 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 14:16:16 INFO - 2017-03-30 14:16:16.385 screenresolution[1890:10603] starting screenresolution argv=screenresolution get 14:16:16 INFO - 2017-03-30 14:16:16.388 screenresolution[1890:10603] Display 0: 1600x1200x32@60 14:16:16 INFO - 2017-03-30 14:16:16.394 screenresolution[1891:10605] starting screenresolution argv=screenresolution list 14:16:16 INFO - Available Modes on Display 0 14:16:16 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 14:16:16 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 14:16:16 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 14:16:16 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 14:16:16 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 14:16:16 INFO - Intel Iris: 14:16:16 INFO - Chipset Model: Intel Iris 14:16:16 INFO - Type: GPU 14:16:16 INFO - Bus: Built-In 14:16:16 INFO - VRAM (Dynamic, Max): 1536 MB 14:16:16 INFO - Vendor: Intel (0x8086) 14:16:16 INFO - Device ID: 0x0a2e 14:16:16 INFO - Revision ID: 0x0009 14:16:16 INFO - Displays: 14:16:16 INFO - Display: 14:16:16 INFO - Resolution: 1600 x 1200 @ 60 Hz 14:16:16 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 14:16:16 INFO - Display Serial Number: 1600x1200 60 14:16:16 INFO - Main Display: Yes 14:16:16 INFO - Mirror: Off 14:16:16 INFO - Online: Yes 14:16:16 INFO - Rotation: Supported 14:16:16 INFO - Return code: 0 14:16:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 14:16:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 14:16:16 INFO - Python 2.7.3 14:16:16 INFO - Return code: 0 14:16:16 INFO - grabbing minidump binary from tooltool 14:16:16 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')]} 14:16:16 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 0x1029ecd30>, '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 0x102913db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1029e1be8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 14:16:16 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 14:16:16 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 14:16:16 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 14:16:16 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 14:16:16 INFO - Return code: 0 14:16:16 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 14:16:16 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 14:16:16 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 14:16:16 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 14:16:16 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 14:16:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0168', '--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 14:16:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0168 --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 14:16:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ksArFS0LiB/Render', 14:16:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 14:16:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 14:16:16 INFO - 'HOME': '/Users/cltbld', 14:16:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 14:16:16 INFO - 'LOGNAME': 'cltbld', 14:16:16 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 14:16:16 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 14:16:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:16:16 INFO - 'MOZ_NO_REMOTE': '1', 14:16:16 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 14:16:16 INFO - 'NO_EM_RESTART': '1', 14:16:16 INFO - 'PAGER': '/bin/cat', 14:16:16 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 14:16:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:16:16 INFO - 'PWD': '/builds/slave/test', 14:16:16 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 14:16:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 14:16:16 INFO - 'SHELL': '/bin/bash', 14:16:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.seOdekMOru/Listeners', 14:16:16 INFO - 'TMPDIR': '/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/', 14:16:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 14:16:16 INFO - 'USER': 'cltbld', 14:16:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 14:16:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 14:16:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:16:16 INFO - 'XPC_FLAGS': '0x0', 14:16:16 INFO - 'XPC_SERVICE_NAME': '0', 14:16:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 14:16:16 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0168', '--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 14:16:16 INFO - mozversion application_buildid: 20170330124805 14:16:16 INFO - mozversion application_changeset: fe3e3c0ea489cea724da1bd56ce20fe843d96a9e 14:16:16 INFO - mozversion application_display_name: Firefox 14:16:16 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 14:16:16 INFO - mozversion application_name: Firefox 14:16:16 INFO - mozversion application_remotingname: firefox 14:16:16 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 14:16:16 INFO - mozversion application_vendor: Mozilla 14:16:16 INFO - mozversion application_version: 53.0 14:16:16 INFO - mozversion platform_buildid: 20170330124805 14:16:16 INFO - mozversion platform_changeset: fe3e3c0ea489cea724da1bd56ce20fe843d96a9e 14:16:16 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 14:16:16 INFO - mozversion platform_version: 53.0 14:16:16 INFO - using testdate: 1490908576 14:16:16 INFO - actual date: 1490908576 14:16:16 INFO - starting webserver on 'localhost:49708' 14:16:16 INFO - SUITE-START | Running 2 tests 14:16:16 INFO - TEST-START | dromaeo_css 14:16:16 INFO - operating with platform_type : mac_ 14:16:16 INFO - Initialising browser for dromaeo_css test... 14:16:17 INFO - TEST-INFO | started process 1901 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/tmpqKHUwY/profile http://localhost:49708/getInfo.html) 14:16:19 INFO - PROCESS | 1901 | 2017-03-30 14:16:19.905 plugin-container[1905:10782] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x8e4b, name = 'com.apple.tsm.portname' 14:16:19 INFO - PROCESS | 1901 | See /usr/include/servers/bootstrap_defs.h for the error codes. 14:16:19 INFO - PROCESS | 1901 | 2017-03-30 14:16:19.905 plugin-container[1905:10782] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x930f, name = 'com.apple.CFPasteboardClient' 14:16:19 INFO - PROCESS | 1901 | See /usr/include/servers/bootstrap_defs.h for the error codes. 14:16:19 INFO - PROCESS | 1901 | 2017-03-30 14:16:19.905 plugin-container[1905:10782] Failed to allocate communication port for com.apple.CFPasteboardClient; this is likely due to sandbox restrictions 14:16:19 INFO - PROCESS | 1901 | __metrics Screen width/height:1600/1200 14:16:19 INFO - PROCESS | 1901 | colorDepth:24 14:16:19 INFO - PROCESS | 1901 | Browser inner width/height: 1024/689 14:16:19 INFO - PROCESS | 1901 | __metrics 14:16:20 ERROR - PROCESS | 1901 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3277: TypeError: this.tabs is undefined 14:16:20 INFO - TEST-INFO | 1901: exit 0 14:16:20 INFO - Browser initialized. 14:16:20 INFO - Running cycle 1/1 for dromaeo_css test... 14:16:20 INFO - TEST-INFO | started process 1906 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/tmpqKHUwY/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:16:23 INFO - PROCESS | 1906 | 2017-03-30 14:16:23.120 plugin-container[1907:10911] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x4247, name = 'com.apple.tsm.portname' 14:16:23 INFO - PROCESS | 1906 | See /usr/include/servers/bootstrap_defs.h for the error codes. 14:16:23 INFO - PROCESS | 1906 | 2017-03-30 14:16:23.120 plugin-container[1907:10911] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x424b, name = 'com.apple.CFPasteboardClient' 14:16:23 INFO - PROCESS | 1906 | See /usr/include/servers/bootstrap_defs.h for the error codes. 14:16:23 INFO - PROCESS | 1906 | 2017-03-30 14:16:23.120 plugin-container[1907:10911] Failed to allocate communication port for com.apple.CFPasteboardClient; this is likely due to sandbox restrictions 14:16:32 INFO - PROCESS | 1906 | RSS: Main: 173039616 14:16:32 INFO - PROCESS | 1906 | 14:19:34 INFO - PROCESS | 1906 | Cycle 1(1): loaded http://localhost:49708/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49708/tests/dromaeo/cssquery-ext.html) 14:19:36 INFO - PROCESS | 1906 | RSS: Main: 192548864 14:19:36 INFO - PROCESS | 1906 | 14:22:38 INFO - PROCESS | 1906 | Cycle 1(1): loaded http://localhost:49708/tests/dromaeo/cssquery-ext.html (next: http://localhost:49708/tests/dromaeo/cssquery-jquery.html) 14:22:39 INFO - PROCESS | 1906 | RSS: Main: 202223616 14:22:39 INFO - PROCESS | 1906 | 14:25:41 INFO - PROCESS | 1906 | Cycle 1(1): loaded http://localhost:49708/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49708/tests/dromaeo/cssquery-mootools.html) 14:25:41 INFO - PROCESS | 1906 | RSS: Main: 203988992 14:25:41 INFO - PROCESS | 1906 | 14:28:43 INFO - PROCESS | 1906 | Cycle 1(1): loaded http://localhost:49708/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49708/tests/dromaeo/cssquery-prototype.html) 14:28:44 INFO - PROCESS | 1906 | RSS: Main: 211013632 14:28:44 INFO - PROCESS | 1906 | 14:31:47 INFO - PROCESS | 1906 | Cycle 1(1): loaded http://localhost:49708/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49708/tests/dromaeo/cssquery-yui.html) 14:31:47 INFO - PROCESS | 1906 | RSS: Main: 212140032 14:31:47 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | Cycle 1(1): loaded http://localhost:49708/tests/dromaeo/cssquery-yui.html (next: http://localhost:49708/tests/dromaeo/cssquery-dojo.html) 14:34:50 INFO - PROCESS | 1906 | RSS: Main: 212672512 14:34:50 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | __start_tp_report 14:34:50 INFO - PROCESS | 1906 | _x_x_mozilla_page_load 14:34:50 INFO - PROCESS | 1906 | _x_x_mozilla_page_load_details 14:34:50 INFO - PROCESS | 1906 | |i|pagename|runs| 14:34:50 INFO - PROCESS | 1906 | |0;dojo.html;3459.42919418296;3474.704650104741;3489.2846966371894;3496.405611046122;3497.7901325920448;5852.707364631768;5936.970315148424;5946.108083787429;5960.6423614583155;5979.46184843364;5845.123231515275;5911.822645320647;5922.496587790032;5945.583809133363;5946.405359464052;5241.8165364212355;5272.789088436458;5326.121190003645;5329.094054010808;5336.839894803162;4313.547077556858;5293.258943747878;5360.678359298435;5368.033753924292;5419.972900135494;3876.341022026248;5278.973605131969;5292.814751483699;5314.441983591725;5366.409694933554;4624.237000894848;4943.9258411123865;5334.733263336837;5396.217548455491;5454.372747134051;4757.620290115897;5276.2085687146855;5346.973265133688;5347.491988261109;5357.973210133963;4871.756412179377;5764.74058667361;5963.314218864843;6082.452579267843;6118.942928706938;6239.500839932794;6278.874422511524;6300.149479820211;6327.114204011442;6375.585586936881;5375.892482150374;5535.58483113768;6282.089097080943;6302.180716506825;6321.525885558555;5241.9213711794355;5394.002109609734;5976.73104710289;6011.819645410645;6027.126066720345;5875.383084776123;6304.621722696653;6308.653024083719;6337.683115844189;6340.841478963062;6266.060090986389;6322.178116844781;6332.430081292706;6336.271328797247;6358.1416508771645;6230.906536401958;6317.810465686037;6331.081993110973;6356.968215158987;6362.872742545123;5438.83683489496;6194.783182588588;6232.937670623326;6302.653354065479;6328.050792381087;5231.319928409359;6265.122882796412;6310.337414571496;6325.683715814191;6342.746290148342;5095.719735414587;5100.566451851634;5112.897742045138;5113.616478764107;5129.9743501282255;4392.2094023075515;4455.287154055336;4506.59440650343;4569.994601187734;4613.331066995267;5982.222311099529;5996.1005849122985;6007.519398448114;6059.606125601822;6063.696815159313;6318.388810853203;6342.39747224013;6348.301686814447;6354.809355719336;6359.17330747;5847.122931560215;5869.765209391662;5880.500157486662;5882.323532793784;5922.378150294243;5514.897020595897;5520.254765606592;5548.944510554924;5561.221428999943;5575.470330318613;6390.169277993831;6400.583962042452;6404.935950640434;6409.839754006187;6410.423061924449;6173.290071641639;6221.595596286227;6227.532935029801;6248.4064013918605;6310.085037669604;6374;6404.807855764335;6407.551471396958;6414.422701956846;6419;6325.905111423424;6326.114343991937;6338.683065846782;6358.745650173942;6366.076918846834;6248.593841400295;6255.124282600348;6256.280527739368;6280.246370435577;6298.496120310456;6228.968855155696;6273.15312432834;6306.747730090745;6334.303226645157;6383.744650213939;6142.2629284484365;6312.842178945563;6330.430261276507;6355.459785918249;6365.840853978502;6019.458248757633;6083.391660833881;6122.081687746873;6183.041628547582;6219.40915613016;6209.59637623553;6245.18812554365;6281.937180628135;6328.810135695937;6338.334474880256;6132.754689812357;6169.907451388322;6200.255969283715;6215.689215539295;6240 14:34:50 INFO - PROCESS | 1906 | |1;ext.html;479.80567870012635;482.45482604656723;492.3918960084295;517.6919732759008;562.2241306996344;42397.78801105998;43317.91705207372;43437;43565.34651980223;43668.344974825326;44153.77923110388;44638;44639;44796.3280550792;44800;9609.951950240256;9822.312438129335;9826.803463930717;10715.303505272172;11642.010429113494;11435.714107147305;11562.8265576016;11569.826452603218;11582.536698532049;11590.478428470738;11561.421928903563;11586.710332241719;11597.014253788439;11608.477618507188;11617.535298588089;11496.367699776509;11501.769964600702;11555.942220288845;11566.826497602542;11575.768484630344;11478.024367928736;11498.540058397737;11574.594889178838;11591.884081159249;11618.535258589647;32802.6719732802;39030.609693903265;39095.41356879649;39518.40722389166;39530.011749706486;3597.1546686528645;4014.7745293477096;4032.7580345179385;4039.2325458162854;4053.1691003344245;24252.272431827074;28481.715182848322;29179.708202918122;29636.110916672533;30761.538576921364;3233.6604656510963;3382.357352103117;3405.4381027130494;3532.487789270567;3535.8585656573705;508197;509129.4543527259;509308;512854;514246.4287678575;62393.752124957246;62521.68739156275;62747.74504509976;62856.37143628597;62882;64304.67847660732;65094;65334.019989700195;65336;65356;17189.398371056952;17391.913040434716;17393.391231307098;17407.91296043512;17417.04206268642;12309;12546.749065018648;13210.33948302581;13428.261445620585;13438.932805335911;15561.610959726097;19011.904940475208;19074.33239836599;19117.90441047786;19377.4186774397;7164.176119746192;7466.2160473150625;7976.5612891290375;8039.83920321602;8093.716719914774;766.5783818899583;824.5588610093571;864.3776480933718;899.9955000224957;901.3195037746459;27569.724302757117;30644.54033189504;31410.21474463111;31717.84141079326;32472.863449779143;1032.385730490357;1063.0591926145416;1063.0857462582173;1114.7826173896012;1120.6357933671588;13875.306234688225;15293.311800968982;16259.51221463358;16344.34622615106;16867.409640662765;665331;670140;673134;674359;675328;56483.43516564864;57581.42418575844;57651.711741441024;57674.423255767746;57755;1339.5512503311304;1452.7021960498073;1495.439210296139;1501.5870635575304;1504.9021813582083;28777.71222287834;30310.84844575763;30551.08346749601;30595.54106688446;30627.846860765552;50761.492385075675;51005;51139;51342.74328628333;51358.22962655638;615236;617487;620323;620966;621202;23844.642330365405;24377;26390.868045660416;26683.33291667724;26809.329766755985;45147.774261128485;45339.546604533534;46387.84030399267;47713.76143119262;48593;31062.844685776425;31317.686823131477;31373.8431307842;31939.6806031946;32383.190420239684;30194.69805301919;30421.239469013453;30923.845380772953;31003.68996310008;31212;35992.4601130978;36619.45070823993;36656.81671591625;37030.889073327846;37084;31222.843885780425;31317.217069573442;31319.587320723207;31429.05712828619;31813.522797158523;20074;24326.51346973086;24407.023719051038;24515.264542063767;24754.752452475244 14:34:50 INFO - PROCESS | 1906 | |2;jquery.html;370.4350864930981;399.616368286445;401.38187191724745;409.32665764816886;431.90942869255144;14471.710565788679;20674.99999999998;21246.83142427166;21979.120835166574;22020;20728.689069663968;20989.790102098974;21774.02016909239;22323.66058036519;22471.887640561814;5823.912641310384;6037.849053773669;6083.8174854754425;6104.267487901436;6138.048602466625;5813.186153938452;5916.171735956969;5975.43233392827;6062.939370606304;6081.391860813927;5940.04959206527;5947.494462970652;5950.70246487676;5958.8808223835495;5962.195103661015;5739.397363276858;5913.940860591425;5921.822345329647;5925.703714814242;5963.075723262901;4537.342085397632;5261.86845328866;5280.287161233261;5293.708846013467;5300.204969254604;26306.86846565755;26342.814573344054;26627.866860665574;26637.600435993474;26866.462670746474;2805.6633204015443;2810.9578356324673;2823.4494273616447;2824.9293767655768;2833.192540126054;13319.86680133196;15391.769123463157;15762.842371576367;16325.673486530322;16450.83549164505;1531.3491765999518;1726.507945235602;1783.9464816055538;1825.589242420458;1852.8888266703907;121709;127300.36349818192;127906;128946.84212631483;129770.0534491974;11629;12103.878961210452;12110.212836165621;12135.361726167032;12165.33090680021;15792.36830526766;15794.842051579568;15889.602759931095;15899.364025439085;15899.602509937344;7753.573553454501;8843.115688431235;9097.727068187965;9121.36150469474;9198.494082825375;8824.51465169409;8852.8672069919;8867.423617464845;8989.820203595891;9064.818703626022;4744.217204161275;4772.952270477251;4787.42550893888;4799.832005879777;4859.465458799529;2009.9698504522444;2060.1141509150907;2062.9277975270793;2065.0397565131984;2068.4001639524367;869.3132425383876;1018.8420794776673;1035.49260862177;1066.818640831045;1069.6629213483145;20703;21231.469213269484;21354.574564055878;21370.824604646583;21757.891210544163;1055.9313644613076;1066.3228849680509;1099.4887377369562;1103.227740581596;1109.8834622364698;10531.631392901212;11167.05080068187;11192.10463162945;11196.94401527987;11198.608048718255;647692;759777.2011140019;764615;778013;784602;114602;125218;149265;153820;155122;957.5164541906292;1078.9028987391173;1085.6308854989184;1110.1451882050937;1110.400383792759;17703.822961770216;18563.81436185675;18638.068096595387;18680.439586812416;18729.71905421447;53879.730601346746;56198;56559.86880262454;57287;57556.71221643865;72981.19056845595;81995.95010124794;87998.56000719956;88516;90597.54701226452;8140.226678465537;8286.171382861665;8365.874511882204;8451.492910425393;8555.786105347415;10424.374537527772;12209.328486933304;12448.190867593577;12547.372631368578;12658.050646201387;9977.60089596408;10182.18542516582;10574.365538067741;10727.570897164025;10910.290831095954;8963.462192268224;9615.375000624937;9850.310478266452;9998.500074996367;10060.64787732455;10940.39827809478;11183.273087249303;11184.776304474028;11197.384143872165;11411.201215915138;7007.334303241184;7649.847003060019;7786.377089832913;8200.42597018203;8518.78703032429;8270.462419942685;10334.586616535555;11271.718207044889;11361.318320900773;11451.198416110792 14:34:50 INFO - PROCESS | 1906 | |3;mootools.html;1263.949442022319;1471.0952764050112;1475.173902614536;1490.180400779571;1494.9626259343515;7782.9103925450345;8028.317593004587;8300.91699083009;8714.389992700513;8734.3885927985;7418.109826820775;8255.339572834175;8450.619722112504;8524.06235314115;8651.870221946676;2379.1316169598144;2433.2943446400523;2437.7805997460314;2440.670509481224;2441.5727247731575;2154.666026765854;2227.487677834099;2395.99368265329;2442.9755702442926;2443.425794938188;2338.672585837984;2426.8786560671983;2427.356750461129;2437.524682686877;2447.8164137689655;2403.987980060106;2412.5536775696464;2427.66012758214;2432.914847980312;2438.6220135878966;2415.7946574541184;2433.6227884677905;2435.111184417675;2462.1259452894324;2462.175171317611;8543.615537300837;8653.134686531359;8720.694775682821;8739.43193692408;8767.956160219223;5306.946930530722;5446;5449.073657478239;5452.809151679672;5471.616986810925;3378.121688361019;3596.4605309203566;3623.710103191738;3631.6186800385844;3642.7814331139953;1210.2254557083475;1240.2682417373703;1253.3044160490924;1278.2330601638942;1282.2050328796206;10606;10904.945475272652;10927.289726167774;11111.944440277828;11116.888831111666;4500.167469018242;4509.864704058883;4685.906281874411;4695.95304046962;4713.858584242478;8853.867191992125;8854.070322616162;8880.067592902782;8890.199882010651;8891.377603567687;5322.414534401213;5335.199720041947;5340.225667278223;5356.143017117242;5357.7589008494715;4865.318855360252;4987.850364489072;4995.525425084684;4996.4503904570465;5032.245163225545;3661.8099117786824;3748.9062773430883;3751.0622344413896;3821.464994900716;3861.6331448512346;876.9517676527852;1022.437659287389;1048.6329784575337;1097.7310558912957;1130.6664533962337;781.1329424338979;787.7715462515806;806.9273765361146;807.8061265296404;817.9386546009073;4801.4718380978065;5158.871028224249;5455.536279416294;5656.264685590847;5719.628224165416;959.6928982725461;990.138579435881;991.3407583956732;1034;1041.7812259425455;3779.5464544254864;3855.9807200963814;3857.209272099269;3951.8024098794945;3974.4634474345594;9929.50352482373;10287.816901056325;10292.433916134685;10302.587896484207;10320.535575899103;10100;10211.642592509226;10213.693589192337;10250.231232657581;10274.897251027394;7634.160242373446;8000.919990800134;8027.879581806277;8127.309178719756;8153.388495862834;5900.144479050599;5923.289205295392;5926.140709596998;6002.369751176238;6083.209182806207;9436.056394360508;9473.621055157717;9590.616375345187;9592.184664303611;9599.952000239955;9430.858537122085;9552.665656701982;9712.17446517054;9727.513624318897;9730.22158227326;6208.81373558794;7439.51643143194;7442.144153422426;7443.255674432514;7448.776536703907;6285.371462853861;7103.467239957127;7700.4224683150105;8007.958965334469;8123.8781418277595;6962.77314401664;7004.299570042955;7084.645767711697;7184.245654206442;7197.1723251824615;6640;6697.229818570732;6753.561018533779;6789.015592739124;6814.829629259309;6552.83617909537;6560.573562718408;6585.242697089896;6606.339366063356;6619.0733297339375;5021.447640759587;5055.090083784954;5119.718415487035;5157.174852023658;5169.759257778182;5089.872753181052;5166.638335316642;5207;5218.425973142876;5236.293100431393 14:34:50 INFO - PROCESS | 1906 | |4;prototype.html;311.86901501369425;367.90802299425144;378.867396411256;383.6374625978448;387.94956655634763;4931.457539670633;5270.947290527093;5329.253904453375;5385.407605163438;5480;4860.538248866361;5445.50990410863;5489.807856725015;5492.80775172869;5517.724113794315;4123.072308730541;4268.530461649216;4274.679399045069;4310.245707001278;4323.459567554056;3545.166885781839;3903;3908.4528166056634;4111.218868415007;4321.395004699345;3389.796632189072;3834.559025712051;3869.9032524186837;4132.359484279927;4145;3609.4405367168133;4113.4035564843225;4130.504339479252;4132.173565286939;4146.688998325138;3043.4065357255345;3517.856696573598;3617.6924961378313;3630.7276954228273;3636.5999740028574;4361.781910904442;5107.489251074863;5298.178782288713;5361.81233656824;5407.405185429599;4172.457580514514;4772;4792.808287668524;4799.760011999421;4806;5253.921191182136;5511.429242665821;5599.796043850551;5822.515258609028;5843.561732870052;3324.5511855899385;3424.760266781326;3661;3893.9415908761393;3961.465202197724;5487.244081893796;5570.1592187984015;5652.98246315663;6204.408737534237;6254.968725156391;3592.604813470516;4034.7377420467574;4063.2482990646827;4072.8799580115115;4077;3612.6387361263664;4003.319435695939;4074.592540745961;4096.201240758023;4119.649829764444;4759.333693282943;4760.857174284777;4765.73788441639;4795.5853023358195;4802.175173434072;5883.529317654577;5894.528437724972;5910.645361278337;5959.493443057302;5974.880502390015;1176.9823452648218;1230.6615680687883;1274.847018357803;1296.507327215652;1338.6921008168176;823.9258466738022;856.07543852639;872.1583671756786;902.0933961368783;910.1490106750209;4576.794044268016;4883.072216278895;5035.79856805731;5174.076646694605;5257.842264732064;5750.741216645261;5824.427404600734;5829.446202610745;5840.88318233633;5854.541092741059;4371.497277813092;4447.599006313001;4648.767561621906;4679.461861885927;5300.4945796073025;2602.3624212067784;2606.8175227734255;2649.854258015789;2947;3049.6950304969328;5046.823361182414;5795;5897.911531327033;5982;6004.849878752979;5189.325387699575;5482.835514934558;5944.405559444021;5959.731812068468;6013.639181649115;5107.131787596118;5716.571257155647;5965.747193089413;5992.711567013113;5996.781190959373;5425.565954723692;5583.804566840141;5597.384287728428;5755.7697692093525;5808.593398462067;5279.630425870152;5314.734263286743;5653.858653533694;5711.543076553782;5726.484616384545;5479.0685583451705;5613;5917.467427931507;6014.278286605635;6029.668368239613;3257.7556683248376;3332.683395077464;3343.9665603343656;3686.8709595165114;3856.672182864488;4729.479757226771;5426.891462170814;5434.945650543602;5612.522935550524;5687.388508297178;5696.715164241854;5753.108268218432;5850.97607918604;5860.476276168312;5861;5568.91646625309;5596.888062238651;5832.996007056285;5845.941540584709;5854.590178687451;5051.6716413433005;5506.366767821752;5549.694766787704;5623.775048997994;5693.544516438592;5739.655620662774;5825.330087039875;5853.507355624289;5858.414158584107;5874.970625146847;4763.785629646605;5251.054810134213;5722.084466485342;5759.337676167127;5772.39389864075 14:34:50 INFO - PROCESS | 1906 | |5;yui.html;730.9415246780258;739.9741009064684;788.6293442082223;796.4862663581989;899.4108858697551;15160.77258841117;15489.14809685467;15745.685086298266;15887.84112158878;15917.04497730137;14525.78211326831;14551.417943282282;14661.486847960323;14666.779998300008;14670.779938300933;885.6413152673161;893.7720881175323;897.6185121323444;899.2715900120891;900.995495022524;719.7336985315441;741.3920585120204;875.4003507597284;890.9376343655947;894.8076163624819;943.1888575824785;954.8710924025272;955.0258736089185;956.942583444992;958.0850287974968;950.7147855643314;951.1677282377954;951.9476428796448;952.3333666433455;952.9904700953041;691.6541729135432;706.9010338552607;708.3801673535656;708.9042979197845;709.1242315740056;12458.563950261789;15224.46714365003;15276.159811210378;15317.617059573487;15581.766273505906;14543.927280363636;14824.777628335583;14840;14943.476978305816;14970.70058598822;11629.244099133613;11660.242084264495;11864.466099025565;11906.46420911061;11946.940265298705;3756.4365345198166;3827;3857.4213867919757;3871.2838124946975;3901.6878649707955;89450;100971;104355;104740.47629761879;105037.84886453343;10721.946390267998;11000.064994475559;11150.163737719704;11309.547618095185;11374.31754094757;18832.717509237373;21345;22117.778822211894;22192.112315507522;22523.774762252167;7696.846063078707;7795.376369890395;7857.371410287164;7894.960525197452;7955.363570914313;4292.5707429257445;4319.8488052918;4392.802323895432;4399.73601583906;4478.865634030984;3566.179778650873;3613.2231570212007;3620.5655321361605;3646.6171052039153;3649.8905032849057;577.7891069759592;671.6238906212536;674.1202730436729;694.6214313199318;698.8427603789107;640.6700549217157;642.922849258092;649.8895187818082;665.1153965226238;666.9066330713704;10221.897781022244;10322.638707645196;10353.119984801226;10542.525586348633;11165.330080195214;586.571802584116;599.9790007349721;609.4667166229549;663.7278715726529;726.4043484342789;4720.079584481062;5141.3830340358645;5191.428942816363;5210.76551555181;5211.921821172686;88657.55671221603;99559.50220248853;103013;104485.47757261318;106644;90292.5485372569;92200.53899730458;92668.07331926729;92765;93147.06852931519;62821.37178628246;74214.62892685502;74613.50772984509;75060.49879002389;75629.24370756332;10025.348352357074;10135;10155.593776248867;10159.085682288629;10168.898311016796;48486.272705908734;51681.224781629055;52043.73978130085;53510.66223344448;53824.46175538351;64666;66034.33965660474;67070.3292967064;67172.32827671661;69228.30771692218;10256.38461692301;10628.627998020032;11729.120315976506;12117.151799374311;12382.380880956096;10730.73173170677;13278.269695166473;13302;13392.330383480592;13529.526466573623;12374.81437778416;12527.624171274876;12556.87443125557;12594.24434533931;12788.808167877676;12338.444769985193;12468.875311246771;12586.685332866751;12653.493860245488;12757.362131893553;11892.881071189177;12283.263004219776;12348.876511234772;12349.444275007825;12455.688607784516;7956.726923692181;9122.224610908148;9257.444553326823;9479.099485548863;9711.181240762126;9676.56455459492;10217.795644087226;10221.33561318512;10231.13035392;10246.590136394461 14:34:50 INFO - PROCESS | 1906 | __end_tp_report 14:34:50 INFO - PROCESS | 1906 | __start_cc_report 14:34:50 INFO - PROCESS | 1906 | _x_x_mozilla_cycle_collect,378 14:34:50 INFO - PROCESS | 1906 | __end_cc_report 14:34:50 INFO - PROCESS | 1906 | __startTimestamp1490909690473__endTimestamp 14:34:50 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | ------- Summary: start ------- 14:34:50 INFO - PROCESS | 1906 | Number of tests: 6 14:34:50 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | [#0] dojo.html Cycles:165 Average:5826.55 Median:6122.08 stddev:679.20 (11.1%) stddev-sans-first:655.41 14:34:50 INFO - PROCESS | 1906 | Values: 3459.4 3474.7 3489.3 3496.4 3497.8 5852.7 5937.0 5946.1 5960.6 5979.5 5845.1 5911.8 5922.5 5945.6 5946.4 5241.8 5272.8 5326.1 5329.1 5336.8 4313.5 5293.3 5360.7 5368.0 5420.0 3876.3 5279.0 5292.8 5314.4 5366.4 4624.2 4943.9 5334.7 5396.2 5454.4 4757.6 5276.2 5347.0 5347.5 5358.0 4871.8 5764.7 5963.3 6082.5 6118.9 6239.5 6278.9 6300.1 6327.1 6375.6 5375.9 5535.6 6282.1 6302.2 6321.5 5241.9 5394.0 5976.7 6011.8 6027.1 5875.4 6304.6 6308.7 6337.7 6340.8 6266.1 6322.2 6332.4 6336.3 6358.1 6230.9 6317.8 6331.1 6357.0 6362.9 5438.8 6194.8 6232.9 6302.7 6328.1 5231.3 6265.1 6310.3 6325.7 6342.7 5095.7 5100.6 5112.9 5113.6 5130.0 4392.2 4455.3 4506.6 4570.0 4613.3 5982.2 5996.1 6007.5 6059.6 6063.7 6318.4 6342.4 6348.3 6354.8 6359.2 5847.1 5869.8 5880.5 5882.3 5922.4 5514.9 5520.3 5548.9 5561.2 5575.5 6390.2 6400.6 6404.9 6409.8 6410.4 6173.3 6221.6 6227.5 6248.4 6310.1 6374.0 6404.8 6407.6 6414.4 6419.0 6325.9 6326.1 6338.7 6358.7 6366.1 6248.6 6255.1 6256.3 6280.2 6298.5 6229.0 6273.2 6306.7 6334.3 6383.7 6142.3 6312.8 6330.4 6355.5 6365.8 6019.5 6083.4 6122.1 6183.0 6219.4 6209.6 6245.2 6281.9 6328.8 6338.3 6132.8 6169.9 6200.3 6215.7 6240.0 14:34:50 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | [#1] ext.html Cycles:180 Average:72762.41 Median:17808.43 stddev:161708.85 (908.0%) stddev-sans-first:162071.41 14:34:50 INFO - PROCESS | 1906 | Values: 479.8 482.5 492.4 517.7 562.2 42397.8 43317.9 43437.0 43565.3 43668.3 44153.8 44638.0 44639.0 44796.3 44800.0 9610.0 9822.3 9826.8 10715.3 11642.0 11435.7 11562.8 11569.8 11582.5 11590.5 11561.4 11586.7 11597.0 11608.5 11617.5 11496.4 11501.8 11555.9 11566.8 11575.8 11478.0 11498.5 11574.6 11591.9 11618.5 32802.7 39030.6 39095.4 39518.4 39530.0 3597.2 4014.8 4032.8 4039.2 4053.2 24252.3 28481.7 29179.7 29636.1 30761.5 3233.7 3382.4 3405.4 3532.5 3535.9 508197.0 509129.5 509308.0 512854.0 514246.4 62393.8 62521.7 62747.7 62856.4 62882.0 64304.7 65094.0 65334.0 65336.0 65356.0 17189.4 17391.9 17393.4 17407.9 17417.0 12309.0 12546.7 13210.3 13428.3 13438.9 15561.6 19011.9 19074.3 19117.9 19377.4 7164.2 7466.2 7976.6 8039.8 8093.7 766.6 824.6 864.4 900.0 901.3 27569.7 30644.5 31410.2 31717.8 32472.9 1032.4 1063.1 1063.1 1114.8 1120.6 13875.3 15293.3 16259.5 16344.3 16867.4 665331.0 670140.0 673134.0 674359.0 675328.0 56483.4 57581.4 57651.7 57674.4 57755.0 1339.6 1452.7 1495.4 1501.6 1504.9 28777.7 30310.8 30551.1 30595.5 30627.8 50761.5 51005.0 51139.0 51342.7 51358.2 615236.0 617487.0 620323.0 620966.0 621202.0 23844.6 24377.0 26390.9 26683.3 26809.3 45147.8 45339.5 46387.8 47713.8 48593.0 31062.8 31317.7 31373.8 31939.7 32383.2 30194.7 30421.2 30923.8 31003.7 31212.0 35992.5 36619.5 36656.8 37030.9 37084.0 31222.8 31317.2 31319.6 31429.1 31813.5 20074.0 24326.5 24407.0 24515.3 24754.8 14:34:50 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | [#2] jquery.html Cycles:180 Average:40240.25 Median:22397.77 stddev:124247.88 (554.7%) stddev-sans-first:124560.36 14:34:50 INFO - PROCESS | 1906 | Values: 370.4 399.6 401.4 409.3 431.9 14471.7 20675.0 21246.8 21979.1 22020.0 20728.7 20989.8 21774.0 22323.7 22471.9 5823.9 6037.8 6083.8 6104.3 6138.0 5813.2 5916.2 5975.4 6062.9 6081.4 5940.0 5947.5 5950.7 5958.9 5962.2 5739.4 5913.9 5921.8 5925.7 5963.1 4537.3 5261.9 5280.3 5293.7 5300.2 26306.9 26342.8 26627.9 26637.6 26866.5 2805.7 2811.0 2823.4 2824.9 2833.2 13319.9 15391.8 15762.8 16325.7 16450.8 1531.3 1726.5 1783.9 1825.6 1852.9 121709.0 127300.4 127906.0 128946.8 129770.1 11629.0 12103.9 12110.2 12135.4 12165.3 15792.4 15794.8 15889.6 15899.4 15899.6 7753.6 8843.1 9097.7 9121.4 9198.5 8824.5 8852.9 8867.4 8989.8 9064.8 4744.2 4773.0 4787.4 4799.8 4859.5 2010.0 2060.1 2062.9 2065.0 2068.4 869.3 1018.8 1035.5 1066.8 1069.7 20703.0 21231.5 21354.6 21370.8 21757.9 1055.9 1066.3 1099.5 1103.2 1109.9 10531.6 11167.1 11192.1 11196.9 11198.6 647692.0 759777.2 764615.0 778013.0 784602.0 114602.0 125218.0 149265.0 153820.0 155122.0 957.5 1078.9 1085.6 1110.1 1110.4 17703.8 18563.8 18638.1 18680.4 18729.7 53879.7 56198.0 56559.9 57287.0 57556.7 72981.2 81996.0 87998.6 88516.0 90597.5 8140.2 8286.2 8365.9 8451.5 8555.8 10424.4 12209.3 12448.2 12547.4 12658.1 9977.6 10182.2 10574.4 10727.6 10910.3 8963.5 9615.4 9850.3 9998.5 10060.6 10940.4 11183.3 11184.8 11197.4 11411.2 7007.3 7649.8 7786.4 8200.4 8518.8 8270.5 10334.6 11271.7 11361.3 11451.2 14:34:50 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | [#3] mootools.html Cycles:180 Average:5513.51 Median:5227.36 stddev:2986.86 (57.1%) stddev-sans-first:2978.16 14:34:50 INFO - PROCESS | 1906 | Values: 1263.9 1471.1 1475.2 1490.2 1495.0 7782.9 8028.3 8300.9 8714.4 8734.4 7418.1 8255.3 8450.6 8524.1 8651.9 2379.1 2433.3 2437.8 2440.7 2441.6 2154.7 2227.5 2396.0 2443.0 2443.4 2338.7 2426.9 2427.4 2437.5 2447.8 2404.0 2412.6 2427.7 2432.9 2438.6 2415.8 2433.6 2435.1 2462.1 2462.2 8543.6 8653.1 8720.7 8739.4 8768.0 5306.9 5446.0 5449.1 5452.8 5471.6 3378.1 3596.5 3623.7 3631.6 3642.8 1210.2 1240.3 1253.3 1278.2 1282.2 10606.0 10904.9 10927.3 11111.9 11116.9 4500.2 4509.9 4685.9 4696.0 4713.9 8853.9 8854.1 8880.1 8890.2 8891.4 5322.4 5335.2 5340.2 5356.1 5357.8 4865.3 4987.9 4995.5 4996.5 5032.2 3661.8 3748.9 3751.1 3821.5 3861.6 877.0 1022.4 1048.6 1097.7 1130.7 781.1 787.8 806.9 807.8 817.9 4801.5 5158.9 5455.5 5656.3 5719.6 959.7 990.1 991.3 1034.0 1041.8 3779.5 3856.0 3857.2 3951.8 3974.5 9929.5 10287.8 10292.4 10302.6 10320.5 10100.0 10211.6 10213.7 10250.2 10274.9 7634.2 8000.9 8027.9 8127.3 8153.4 5900.1 5923.3 5926.1 6002.4 6083.2 9436.1 9473.6 9590.6 9592.2 9600.0 9430.9 9552.7 9712.2 9727.5 9730.2 6208.8 7439.5 7442.1 7443.3 7448.8 6285.4 7103.5 7700.4 8008.0 8123.9 6962.8 7004.3 7084.6 7184.2 7197.2 6640.0 6697.2 6753.6 6789.0 6814.8 6552.8 6560.6 6585.2 6606.3 6619.1 5021.4 5055.1 5119.7 5157.2 5169.8 5089.9 5166.6 5207.0 5218.4 5236.3 14:34:50 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | [#4] prototype.html Cycles:180 Average:4609.05 Median:5264.39 stddev:1444.27 (27.4%) stddev-sans-first:1411.85 14:34:50 INFO - PROCESS | 1906 | Values: 311.9 367.9 378.9 383.6 387.9 4931.5 5270.9 5329.3 5385.4 5480.0 4860.5 5445.5 5489.8 5492.8 5517.7 4123.1 4268.5 4274.7 4310.2 4323.5 3545.2 3903.0 3908.5 4111.2 4321.4 3389.8 3834.6 3869.9 4132.4 4145.0 3609.4 4113.4 4130.5 4132.2 4146.7 3043.4 3517.9 3617.7 3630.7 3636.6 4361.8 5107.5 5298.2 5361.8 5407.4 4172.5 4772.0 4792.8 4799.8 4806.0 5253.9 5511.4 5599.8 5822.5 5843.6 3324.6 3424.8 3661.0 3893.9 3961.5 5487.2 5570.2 5653.0 6204.4 6255.0 3592.6 4034.7 4063.2 4072.9 4077.0 3612.6 4003.3 4074.6 4096.2 4119.6 4759.3 4760.9 4765.7 4795.6 4802.2 5883.5 5894.5 5910.6 5959.5 5974.9 1177.0 1230.7 1274.8 1296.5 1338.7 823.9 856.1 872.2 902.1 910.1 4576.8 4883.1 5035.8 5174.1 5257.8 5750.7 5824.4 5829.4 5840.9 5854.5 4371.5 4447.6 4648.8 4679.5 5300.5 2602.4 2606.8 2649.9 2947.0 3049.7 5046.8 5795.0 5897.9 5982.0 6004.8 5189.3 5482.8 5944.4 5959.7 6013.6 5107.1 5716.6 5965.7 5992.7 5996.8 5425.6 5583.8 5597.4 5755.8 5808.6 5279.6 5314.7 5653.9 5711.5 5726.5 5479.1 5613.0 5917.5 6014.3 6029.7 3257.8 3332.7 3344.0 3686.9 3856.7 4729.5 5426.9 5434.9 5612.5 5687.4 5696.7 5753.1 5851.0 5860.5 5861.0 5568.9 5596.9 5833.0 5845.9 5854.6 5051.7 5506.4 5549.7 5623.8 5693.5 5739.7 5825.3 5853.5 5858.4 5875.0 4763.8 5251.1 5722.1 5759.3 5772.4 14:34:50 INFO - PROCESS | 1906 | 14:34:50 INFO - PROCESS | 1906 | [#5] yui.html Cycles:180 Average:20065.64 Median:4097.13 stddev:28816.63 (703.3%) stddev-sans-first:28860.89 14:34:50 INFO - PROCESS | 1906 | Values: 730.9 740.0 788.6 796.5 899.4 15160.8 15489.1 15745.7 15887.8 15917.0 14525.8 14551.4 14661.5 14666.8 14670.8 885.6 893.8 897.6 899.3 901.0 719.7 741.4 875.4 890.9 894.8 943.2 954.9 955.0 956.9 958.1 950.7 951.2 951.9 952.3 953.0 691.7 706.9 708.4 708.9 709.1 12458.6 15224.5 15276.2 15317.6 15581.8 14543.9 14824.8 14840.0 14943.5 14970.7 11629.2 11660.2 11864.5 11906.5 11946.9 3756.4 3827.0 3857.4 3871.3 3901.7 89450.0 100971.0 104355.0 104740.5 105037.8 10721.9 11000.1 11150.2 11309.5 11374.3 18832.7 21345.0 22117.8 22192.1 22523.8 7696.8 7795.4 7857.4 7895.0 7955.4 4292.6 4319.8 4392.8 4399.7 4478.9 3566.2 3613.2 3620.6 3646.6 3649.9 577.8 671.6 674.1 694.6 698.8 640.7 642.9 649.9 665.1 666.9 10221.9 10322.6 10353.1 10542.5 11165.3 586.6 600.0 609.5 663.7 726.4 4720.1 5141.4 5191.4 5210.8 5211.9 88657.6 99559.5 103013.0 104485.5 106644.0 90292.5 92200.5 92668.1 92765.0 93147.1 62821.4 74214.6 74613.5 75060.5 75629.2 10025.3 10135.0 10155.6 10159.1 10168.9 48486.3 51681.2 52043.7 53510.7 53824.5 64666.0 66034.3 67070.3 67172.3 69228.3 10256.4 10628.6 11729.1 12117.2 12382.4 10730.7 13278.3 13302.0 13392.3 13529.5 12374.8 12527.6 12556.9 12594.2 12788.8 12338.4 12468.9 12586.7 12653.5 12757.4 11892.9 12283.3 12348.9 12349.4 12455.7 7956.7 9122.2 9257.4 9479.1 9711.2 9676.6 10217.8 10221.3 10231.1 10246.6 14:34:50 INFO - PROCESS | 1906 | -------- Summary: end -------- 14:34:50 INFO - PROCESS | 1906 | 14:34:51 INFO - TEST-INFO | 1906: exit 0 14:34:51 INFO - TEST-OK | dromaeo_css | took 1114065ms 14:34:51 INFO - TEST-START | kraken 14:34:51 INFO - operating with platform_type : mac_ 14:34:51 INFO - Initialising browser for kraken test... 14:34:51 INFO - TEST-INFO | started process 1912 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/tmpsHEfcI/profile http://localhost:49708/getInfo.html) 14:34:53 INFO - PROCESS | 1912 | 2017-03-30 14:34:53.795 plugin-container[1913:12712] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x4247, name = 'com.apple.tsm.portname' 14:34:53 INFO - PROCESS | 1912 | See /usr/include/servers/bootstrap_defs.h for the error codes. 14:34:53 INFO - PROCESS | 1912 | 2017-03-30 14:34:53.796 plugin-container[1913:12712] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x8c0b, name = 'com.apple.CFPasteboardClient' 14:34:53 INFO - PROCESS | 1912 | See /usr/include/servers/bootstrap_defs.h for the error codes. 14:34:53 INFO - PROCESS | 1912 | 2017-03-30 14:34:53.796 plugin-container[1913:12712] Failed to allocate communication port for com.apple.CFPasteboardClient; this is likely due to sandbox restrictions 14:34:53 INFO - PROCESS | 1912 | __metrics Screen width/height:1600/1200 14:34:53 INFO - PROCESS | 1912 | colorDepth:24 14:34:53 INFO - PROCESS | 1912 | Browser inner width/height: 1024/689 14:34:53 INFO - PROCESS | 1912 | __metrics 14:34:53 ERROR - PROCESS | 1912 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3277: TypeError: this.tabs is undefined 14:34:54 INFO - TEST-INFO | 1912: exit 0 14:34:54 INFO - Browser initialized. 14:34:54 INFO - Running cycle 1/1 for kraken test... 14:34:54 INFO - TEST-INFO | started process 1914 (/builds/slave/test/build/application/Firefox.app/Contents/MacOS/firefox -foreground -profile /var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/T/tmpsHEfcI/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:34:57 INFO - PROCESS | 1914 | 2017-03-30 14:34:57.089 plugin-container[1915:12843] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x8643, name = 'com.apple.tsm.portname' 14:34:57 INFO - PROCESS | 1914 | See /usr/include/servers/bootstrap_defs.h for the error codes. 14:34:57 INFO - PROCESS | 1914 | 2017-03-30 14:34:57.090 plugin-container[1915:12843] *** CFMessagePort: bootstrap_register(): failed 1100 (0x44c) 'Permission denied', port = 0x8b03, name = 'com.apple.CFPasteboardClient' 14:34:57 INFO - PROCESS | 1914 | See /usr/include/servers/bootstrap_defs.h for the error codes. 14:34:57 INFO - PROCESS | 1914 | 2017-03-30 14:34:57.090 plugin-container[1915:12843] Failed to allocate communication port for com.apple.CFPasteboardClient; this is likely due to sandbox restrictions 14:35:06 INFO - PROCESS | 1914 | RSS: Main: 173219840 14:35:06 INFO - PROCESS | 1914 | 14:35:09 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49708/tests/kraken/driver.html?testName=audio-beat-detection) 14:35:10 INFO - PROCESS | 1914 | RSS: Main: 186044416 14:35:10 INFO - PROCESS | 1914 | 14:35:13 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49708/tests/kraken/driver.html?testName=audio-dft) 14:35:13 INFO - PROCESS | 1914 | RSS: Main: 193810432 14:35:13 INFO - PROCESS | 1914 | 14:35:17 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49708/tests/kraken/driver.html?testName=audio-fft) 14:35:17 INFO - PROCESS | 1914 | RSS: Main: 197681152 14:35:17 INFO - PROCESS | 1914 | 14:35:19 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49708/tests/kraken/driver.html?testName=audio-oscillator) 14:35:20 INFO - PROCESS | 1914 | RSS: Main: 198004736 14:35:20 INFO - PROCESS | 1914 | 14:35:22 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49708/tests/kraken/driver.html?testName=imaging-gaussian-blur) 14:35:22 INFO - PROCESS | 1914 | RSS: Main: 197971968 14:35:22 INFO - PROCESS | 1914 | 14:35:25 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49708/tests/kraken/driver.html?testName=imaging-darkroom) 14:35:26 INFO - PROCESS | 1914 | RSS: Main: 203620352 14:35:26 INFO - PROCESS | 1914 | 14:35:29 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49708/tests/kraken/driver.html?testName=imaging-desaturate) 14:35:30 INFO - PROCESS | 1914 | RSS: Main: 203939840 14:35:30 INFO - PROCESS | 1914 | 14:35:33 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49708/tests/kraken/driver.html?testName=json-parse-financial) 14:35:33 INFO - PROCESS | 1914 | RSS: Main: 203276288 14:35:33 INFO - PROCESS | 1914 | 14:35:35 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49708/tests/kraken/driver.html?testName=json-stringify-tinderbox) 14:35:36 INFO - PROCESS | 1914 | RSS: Main: 202395648 14:35:36 INFO - PROCESS | 1914 | 14:35:38 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49708/tests/kraken/driver.html?testName=stanford-crypto-aes) 14:35:38 INFO - PROCESS | 1914 | RSS: Main: 202473472 14:35:38 INFO - PROCESS | 1914 | 14:35:40 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49708/tests/kraken/driver.html?testName=stanford-crypto-ccm) 14:35:41 INFO - PROCESS | 1914 | RSS: Main: 202436608 14:35:41 INFO - PROCESS | 1914 | 14:35:44 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49708/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 14:35:45 INFO - PROCESS | 1914 | RSS: Main: 202842112 14:35:45 INFO - PROCESS | 1914 | 14:35:47 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49708/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 14:35:48 INFO - PROCESS | 1914 | RSS: Main: 202862592 14:35:48 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | Cycle 1(1): loaded http://localhost:49708/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49708/tests/kraken/driver.html?testName=ai-astar) 14:35:50 INFO - PROCESS | 1914 | RSS: Main: 204574720 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | __start_tp_report 14:35:50 INFO - PROCESS | 1914 | _x_x_mozilla_page_load 14:35:50 INFO - PROCESS | 1914 | _x_x_mozilla_page_load_details 14:35:50 INFO - PROCESS | 1914 | |i|pagename|runs| 14:35:50 INFO - PROCESS | 1914 | |0;ai-astar;105;115;117;119;118;120;117;117;119;119 14:35:50 INFO - PROCESS | 1914 | |1;audio-beat-detection;169;141;113;145;109;114;111;109;130;110 14:35:50 INFO - PROCESS | 1914 | |2;audio-dft;197;203;196;199;197;200;196;199;197;197 14:35:50 INFO - PROCESS | 1914 | |3;audio-fft;75;58;59;86;58;60;60;84;71;60 14:35:50 INFO - PROCESS | 1914 | |4;audio-oscillator;94;72;86;73;69;71;93;93;71;81 14:35:50 INFO - PROCESS | 1914 | |5;imaging-gaussian-blur;95;81;136;130;92;80;131;116;115;86 14:35:50 INFO - PROCESS | 1914 | |6;imaging-darkroom;101;105;101;127;171;102;103;103;102;118 14:35:50 INFO - PROCESS | 1914 | |7;imaging-desaturate;96;142;114;96;92;94;96;77;142;143 14:35:50 INFO - PROCESS | 1914 | |8;json-parse-financial;58;58;58;58;61;62;60;61;60;58 14:35:50 INFO - PROCESS | 1914 | |9;json-stringify-tinderbox;71;73;68;76;72;69;67;73;66;70 14:35:50 INFO - PROCESS | 1914 | |10;stanford-crypto-aes;83;80;88;71;90;102;99;103;105;80 14:35:50 INFO - PROCESS | 1914 | |11;stanford-crypto-ccm;136;135;147;139;133;143;159;154;180;135 14:35:50 INFO - PROCESS | 1914 | |12;stanford-crypto-pbkdf2;167;164;168;172;168;166;167;167;174;147 14:35:50 INFO - PROCESS | 1914 | |13;stanford-crypto-sha256-iterative;66;66;67;64;66;68;82;85;90;84 14:35:50 INFO - PROCESS | 1914 | __end_tp_report 14:35:50 INFO - PROCESS | 1914 | __start_cc_report 14:35:50 INFO - PROCESS | 1914 | _x_x_mozilla_cycle_collect,939 14:35:50 INFO - PROCESS | 1914 | __end_cc_report 14:35:50 INFO - PROCESS | 1914 | __startTimestamp1490909750557__endTimestamp 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | ------- Summary: start ------- 14:35:50 INFO - PROCESS | 1914 | Number of tests: 14 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#0] ai-astar Cycles:10 Average:116.60 Median:118.50 stddev:4.33 (3.7%) stddev-sans-first:1.54 14:35:50 INFO - PROCESS | 1914 | Values: 105.0 115.0 117.0 119.0 118.0 120.0 117.0 117.0 119.0 119.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#1] audio-beat-detection Cycles:10 Average:125.10 Median:122.00 stddev:20.59 (16.9%) stddev-sans-first:14.46 14:35:50 INFO - PROCESS | 1914 | Values: 169.0 141.0 113.0 145.0 109.0 114.0 111.0 109.0 130.0 110.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#2] audio-dft Cycles:10 Average:198.10 Median:198.00 stddev:2.18 (1.1%) stddev-sans-first:2.28 14:35:50 INFO - PROCESS | 1914 | Values: 197.0 203.0 196.0 199.0 197.0 200.0 196.0 199.0 197.0 197.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#3] audio-fft Cycles:10 Average:67.10 Median:65.50 stddev:11.07 (16.9%) stddev-sans-first:11.37 14:35:50 INFO - PROCESS | 1914 | Values: 75.0 58.0 59.0 86.0 58.0 60.0 60.0 84.0 71.0 60.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#4] audio-oscillator Cycles:10 Average:80.30 Median:83.50 stddev:10.36 (12.4%) stddev-sans-first:9.73 14:35:50 INFO - PROCESS | 1914 | Values: 94.0 72.0 86.0 73.0 69.0 71.0 93.0 93.0 71.0 81.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#5] imaging-gaussian-blur Cycles:10 Average:106.20 Median:80.50 stddev:21.86 (27.2%) stddev-sans-first:22.80 14:35:50 INFO - PROCESS | 1914 | Values: 95.0 81.0 136.0 130.0 92.0 80.0 131.0 116.0 115.0 86.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#6] imaging-darkroom Cycles:10 Average:113.30 Median:104.00 stddev:22.06 (21.2%) stddev-sans-first:22.94 14:35:50 INFO - PROCESS | 1914 | Values: 101.0 105.0 101.0 127.0 171.0 102.0 103.0 103.0 102.0 118.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#7] imaging-desaturate Cycles:10 Average:109.20 Median:93.00 stddev:24.50 (26.3%) stddev-sans-first:25.52 14:35:50 INFO - PROCESS | 1914 | Values: 96.0 142.0 114.0 96.0 92.0 94.0 96.0 77.0 142.0 143.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#8] json-parse-financial Cycles:10 Average:59.40 Median:60.00 stddev:1.58 (2.6%) stddev-sans-first:1.59 14:35:50 INFO - PROCESS | 1914 | Values: 58.0 58.0 58.0 58.0 61.0 62.0 60.0 61.0 60.0 58.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#9] json-stringify-tinderbox Cycles:10 Average:70.50 Median:71.50 stddev:3.10 (4.3%) stddev-sans-first:3.28 14:35:50 INFO - PROCESS | 1914 | Values: 71.0 73.0 68.0 76.0 72.0 69.0 67.0 73.0 66.0 70.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#10] stanford-crypto-aes Cycles:10 Average:90.10 Median:81.50 stddev:11.70 (14.4%) stddev-sans-first:12.13 14:35:50 INFO - PROCESS | 1914 | Values: 83.0 80.0 88.0 71.0 90.0 102.0 99.0 103.0 105.0 80.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#11] stanford-crypto-ccm Cycles:10 Average:146.10 Median:145.00 stddev:14.75 (10.2%) stddev-sans-first:15.19 14:35:50 INFO - PROCESS | 1914 | Values: 136.0 135.0 147.0 139.0 133.0 143.0 159.0 154.0 180.0 135.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.00 Median:167.50 stddev:7.27 (4.3%) stddev-sans-first:7.70 14:35:50 INFO - PROCESS | 1914 | Values: 167.0 164.0 168.0 172.0 168.0 166.0 167.0 167.0 174.0 147.0 14:35:50 INFO - PROCESS | 1914 | 14:35:50 INFO - PROCESS | 1914 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:73.80 Median:75.00 stddev:10.10 (13.5%) stddev-sans-first:10.31 14:35:50 INFO - PROCESS | 1914 | Values: 66.0 66.0 67.0 64.0 66.0 68.0 82.0 85.0 90.0 84.0 14:35:50 INFO - PROCESS | 1914 | -------- Summary: end -------- 14:35:50 INFO - PROCESS | 1914 | 14:35:51 INFO - TEST-INFO | 1914: exit 0 14:35:51 INFO - TEST-OK | kraken | took 60327ms 14:35:51 INFO - SUITE-END | took 1174s 14:35:51 INFO - Completed test suite (00:19:34) 14:35:51 INFO - javascript benchmark 14:35:51 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7392.417441842965, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3459.42919418296, 3474.704650104741, 3489.2846966371894, 3496.405611046122, 3497.7901325920448, 5852.707364631768, 5936.970315148424, 5946.108083787429, 5960.6423614583155, 5979.46184843364, 5845.123231515275, 5911.822645320647, 5922.496587790032, 5945.583809133363, 5946.405359464052, 5241.8165364212355, 5272.789088436458, 5326.121190003645, 5329.094054010808, 5336.839894803162, 4313.547077556858, 5293.258943747878, 5360.678359298435, 5368.033753924292, 5419.972900135494, 3876.341022026248, 5278.973605131969, 5292.814751483699, 5314.441983591725, 5366.409694933554, 4624.237000894848, 4943.9258411123865, 5334.733263336837, 5396.217548455491, 5454.372747134051, 4757.620290115897, 5276.2085687146855, 5346.973265133688, 5347.491988261109, 5357.973210133963, 4871.756412179377, 5764.74058667361, 5963.314218864843, 6082.452579267843, 6118.942928706938, 6239.500839932794, 6278.874422511524, 6300.149479820211, 6327.114204011442, 6375.585586936881, 5375.892482150374, 5535.58483113768, 6282.089097080943, 6302.180716506825, 6321.525885558555, 5241.9213711794355, 5394.002109609734, 5976.73104710289, 6011.819645410645, 6027.126066720345, 5875.383084776123, 6304.621722696653, 6308.653024083719, 6337.683115844189, 6340.841478963062, 6266.060090986389, 6322.178116844781, 6332.430081292706, 6336.271328797247, 6358.1416508771645, 6230.906536401958, 6317.810465686037, 6331.081993110973, 6356.968215158987, 6362.872742545123, 5438.83683489496, 6194.783182588588, 6232.937670623326, 6302.653354065479, 6328.050792381087, 5231.319928409359, 6265.122882796412, 6310.337414571496, 6325.683715814191, 6342.746290148342, 5095.719735414587, 5100.566451851634, 5112.897742045138, 5113.616478764107, 5129.9743501282255, 4392.2094023075515, 4455.287154055336, 4506.59440650343, 4569.994601187734, 4613.331066995267, 5982.222311099529, 5996.1005849122985, 6007.519398448114, 6059.606125601822, 6063.696815159313, 6318.388810853203, 6342.39747224013, 6348.301686814447, 6354.809355719336, 6359.17330747, 5847.122931560215, 5869.765209391662, 5880.500157486662, 5882.323532793784, 5922.378150294243, 5514.897020595897, 5520.254765606592, 5548.944510554924, 5561.221428999943, 5575.470330318613, 6390.169277993831, 6400.583962042452, 6404.935950640434, 6409.839754006187, 6410.423061924449, 6173.290071641639, 6221.595596286227, 6227.532935029801, 6248.4064013918605, 6310.085037669604, 6374.0, 6404.807855764335, 6407.551471396958, 6414.422701956846, 6419.0, 6325.905111423424, 6326.114343991937, 6338.683065846782, 6358.745650173942, 6366.076918846834, 6248.593841400295, 6255.124282600348, 6256.280527739368, 6280.246370435577, 6298.496120310456, 6228.968855155696, 6273.15312432834, 6306.747730090745, 6334.303226645157, 6383.744650213939, 6142.2629284484365, 6312.842178945563, 6330.430261276507, 6355.459785918249, 6365.840853978502, 6019.458248757633, 6083.391660833881, 6122.081687746873, 6183.041628547582, 6219.40915613016, 6209.59637623553, 6245.18812554365, 6281.937180628135, 6328.810135695937, 6338.334474880256, 6132.754689812357, 6169.907451388322, 6200.255969283715, 6215.689215539295, 6240.0], "value": 5784.843538666027, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [479.80567870012635, 482.45482604656723, 492.3918960084295, 517.6919732759008, 562.2241306996344, 42397.78801105998, 43317.91705207372, 43437.0, 43565.34651980223, 43668.344974825326, 44153.77923110388, 44638.0, 44639.0, 44796.3280550792, 44800.0, 9609.951950240256, 9822.312438129335, 9826.803463930717, 10715.303505272172, 11642.010429113494, 11435.714107147305, 11562.8265576016, 11569.826452603218, 11582.536698532049, 11590.478428470738, 11561.421928903563, 11586.710332241719, 11597.014253788439, 11608.477618507188, 11617.535298588089, 11496.367699776509, 11501.769964600702, 11555.942220288845, 11566.826497602542, 11575.768484630344, 11478.024367928736, 11498.540058397737, 11574.594889178838, 11591.884081159249, 11618.535258589647, 32802.6719732802, 39030.609693903265, 39095.41356879649, 39518.40722389166, 39530.011749706486, 3597.1546686528645, 4014.7745293477096, 4032.7580345179385, 4039.2325458162854, 4053.1691003344245, 24252.272431827074, 28481.715182848322, 29179.708202918122, 29636.110916672533, 30761.538576921364, 3233.6604656510963, 3382.357352103117, 3405.4381027130494, 3532.487789270567, 3535.8585656573705, 508197.0, 509129.4543527259, 509308.0, 512854.0, 514246.4287678575, 62393.752124957246, 62521.68739156275, 62747.74504509976, 62856.37143628597, 62882.0, 64304.67847660732, 65094.0, 65334.019989700195, 65336.0, 65356.0, 17189.398371056952, 17391.913040434716, 17393.391231307098, 17407.91296043512, 17417.04206268642, 12309.0, 12546.749065018648, 13210.33948302581, 13428.261445620585, 13438.932805335911, 15561.610959726097, 19011.904940475208, 19074.33239836599, 19117.90441047786, 19377.4186774397, 7164.176119746192, 7466.2160473150625, 7976.5612891290375, 8039.83920321602, 8093.716719914774, 766.5783818899583, 824.5588610093571, 864.3776480933718, 899.9955000224957, 901.3195037746459, 27569.724302757117, 30644.54033189504, 31410.21474463111, 31717.84141079326, 32472.863449779143, 1032.385730490357, 1063.0591926145416, 1063.0857462582173, 1114.7826173896012, 1120.6357933671588, 13875.306234688225, 15293.311800968982, 16259.51221463358, 16344.34622615106, 16867.409640662765, 665331.0, 670140.0, 673134.0, 674359.0, 675328.0, 56483.43516564864, 57581.42418575844, 57651.711741441024, 57674.423255767746, 57755.0, 1339.5512503311304, 1452.7021960498073, 1495.439210296139, 1501.5870635575304, 1504.9021813582083, 28777.71222287834, 30310.84844575763, 30551.08346749601, 30595.54106688446, 30627.846860765552, 50761.492385075675, 51005.0, 51139.0, 51342.74328628333, 51358.22962655638, 615236.0, 617487.0, 620323.0, 620966.0, 621202.0, 23844.642330365405, 24377.0, 26390.868045660416, 26683.33291667724, 26809.329766755985, 45147.774261128485, 45339.546604533534, 46387.84030399267, 47713.76143119262, 48593.0, 31062.844685776425, 31317.686823131477, 31373.8431307842, 31939.6806031946, 32383.190420239684, 30194.69805301919, 30421.239469013453, 30923.845380772953, 31003.68996310008, 31212.0, 35992.4601130978, 36619.45070823993, 36656.81671591625, 37030.889073327846, 37084.0, 31222.843885780425, 31317.217069573442, 31319.587320723207, 31429.05712828619, 31813.522797158523, 20074.0, 24326.51346973086, 24407.023719051038, 24515.264542063767, 24754.752452475244], "value": 20373.80708893346, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [370.4350864930981, 399.616368286445, 401.38187191724745, 409.32665764816886, 431.90942869255144, 14471.710565788679, 20674.99999999998, 21246.83142427166, 21979.120835166574, 22020.0, 20728.689069663968, 20989.790102098974, 21774.02016909239, 22323.66058036519, 22471.887640561814, 5823.912641310384, 6037.849053773669, 6083.8174854754425, 6104.267487901436, 6138.048602466625, 5813.186153938452, 5916.171735956969, 5975.43233392827, 6062.939370606304, 6081.391860813927, 5940.04959206527, 5947.494462970652, 5950.70246487676, 5958.8808223835495, 5962.195103661015, 5739.397363276858, 5913.940860591425, 5921.822345329647, 5925.703714814242, 5963.075723262901, 4537.342085397632, 5261.86845328866, 5280.287161233261, 5293.708846013467, 5300.204969254604, 26306.86846565755, 26342.814573344054, 26627.866860665574, 26637.600435993474, 26866.462670746474, 2805.6633204015443, 2810.9578356324673, 2823.4494273616447, 2824.9293767655768, 2833.192540126054, 13319.86680133196, 15391.769123463157, 15762.842371576367, 16325.673486530322, 16450.83549164505, 1531.3491765999518, 1726.507945235602, 1783.9464816055538, 1825.589242420458, 1852.8888266703907, 121709.0, 127300.36349818192, 127906.0, 128946.84212631483, 129770.0534491974, 11629.0, 12103.878961210452, 12110.212836165621, 12135.361726167032, 12165.33090680021, 15792.36830526766, 15794.842051579568, 15889.602759931095, 15899.364025439085, 15899.602509937344, 7753.573553454501, 8843.115688431235, 9097.727068187965, 9121.36150469474, 9198.494082825375, 8824.51465169409, 8852.8672069919, 8867.423617464845, 8989.820203595891, 9064.818703626022, 4744.217204161275, 4772.952270477251, 4787.42550893888, 4799.832005879777, 4859.465458799529, 2009.9698504522444, 2060.1141509150907, 2062.9277975270793, 2065.0397565131984, 2068.4001639524367, 869.3132425383876, 1018.8420794776673, 1035.49260862177, 1066.818640831045, 1069.6629213483145, 20703.0, 21231.469213269484, 21354.574564055878, 21370.824604646583, 21757.891210544163, 1055.9313644613076, 1066.3228849680509, 1099.4887377369562, 1103.227740581596, 1109.8834622364698, 10531.631392901212, 11167.05080068187, 11192.10463162945, 11196.94401527987, 11198.608048718255, 647692.0, 759777.2011140019, 764615.0, 778013.0, 784602.0, 114602.0, 125218.0, 149265.0, 153820.0, 155122.0, 957.5164541906292, 1078.9028987391173, 1085.6308854989184, 1110.1451882050937, 1110.400383792759, 17703.822961770216, 18563.81436185675, 18638.068096595387, 18680.439586812416, 18729.71905421447, 53879.730601346746, 56198.0, 56559.86880262454, 57287.0, 57556.71221643865, 72981.19056845595, 81995.95010124794, 87998.56000719956, 88516.0, 90597.54701226452, 8140.226678465537, 8286.171382861665, 8365.874511882204, 8451.492910425393, 8555.786105347415, 10424.374537527772, 12209.328486933304, 12448.190867593577, 12547.372631368578, 12658.050646201387, 9977.60089596408, 10182.18542516582, 10574.365538067741, 10727.570897164025, 10910.290831095954, 8963.462192268224, 9615.375000624937, 9850.310478266452, 9998.500074996367, 10060.64787732455, 10940.39827809478, 11183.273087249303, 11184.776304474028, 11197.384143872165, 11411.201215915138, 7007.334303241184, 7649.847003060019, 7786.377089832913, 8200.42597018203, 8518.78703032429, 8270.462419942685, 10334.586616535555, 11271.718207044889, 11361.318320900773, 11451.198416110792], "value": 10009.104118223366, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1263.949442022319, 1471.0952764050112, 1475.173902614536, 1490.180400779571, 1494.9626259343515, 7782.9103925450345, 8028.317593004587, 8300.91699083009, 8714.389992700513, 8734.3885927985, 7418.109826820775, 8255.339572834175, 8450.619722112504, 8524.06235314115, 8651.870221946676, 2379.1316169598144, 2433.2943446400523, 2437.7805997460314, 2440.670509481224, 2441.5727247731575, 2154.666026765854, 2227.487677834099, 2395.99368265329, 2442.9755702442926, 2443.425794938188, 2338.672585837984, 2426.8786560671983, 2427.356750461129, 2437.524682686877, 2447.8164137689655, 2403.987980060106, 2412.5536775696464, 2427.66012758214, 2432.914847980312, 2438.6220135878966, 2415.7946574541184, 2433.6227884677905, 2435.111184417675, 2462.1259452894324, 2462.175171317611, 8543.615537300837, 8653.134686531359, 8720.694775682821, 8739.43193692408, 8767.956160219223, 5306.946930530722, 5446.0, 5449.073657478239, 5452.809151679672, 5471.616986810925, 3378.121688361019, 3596.4605309203566, 3623.710103191738, 3631.6186800385844, 3642.7814331139953, 1210.2254557083475, 1240.2682417373703, 1253.3044160490924, 1278.2330601638942, 1282.2050328796206, 10606.0, 10904.945475272652, 10927.289726167774, 11111.944440277828, 11116.888831111666, 4500.167469018242, 4509.864704058883, 4685.906281874411, 4695.95304046962, 4713.858584242478, 8853.867191992125, 8854.070322616162, 8880.067592902782, 8890.199882010651, 8891.377603567687, 5322.414534401213, 5335.199720041947, 5340.225667278223, 5356.143017117242, 5357.7589008494715, 4865.318855360252, 4987.850364489072, 4995.525425084684, 4996.4503904570465, 5032.245163225545, 3661.8099117786824, 3748.9062773430883, 3751.0622344413896, 3821.464994900716, 3861.6331448512346, 876.9517676527852, 1022.437659287389, 1048.6329784575337, 1097.7310558912957, 1130.6664533962337, 781.1329424338979, 787.7715462515806, 806.9273765361146, 807.8061265296404, 817.9386546009073, 4801.4718380978065, 5158.871028224249, 5455.536279416294, 5656.264685590847, 5719.628224165416, 959.6928982725461, 990.138579435881, 991.3407583956732, 1034.0, 1041.7812259425455, 3779.5464544254864, 3855.9807200963814, 3857.209272099269, 3951.8024098794945, 3974.4634474345594, 9929.50352482373, 10287.816901056325, 10292.433916134685, 10302.587896484207, 10320.535575899103, 10100.0, 10211.642592509226, 10213.693589192337, 10250.231232657581, 10274.897251027394, 7634.160242373446, 8000.919990800134, 8027.879581806277, 8127.309178719756, 8153.388495862834, 5900.144479050599, 5923.289205295392, 5926.140709596998, 6002.369751176238, 6083.209182806207, 9436.056394360508, 9473.621055157717, 9590.616375345187, 9592.184664303611, 9599.952000239955, 9430.858537122085, 9552.665656701982, 9712.17446517054, 9727.513624318897, 9730.22158227326, 6208.81373558794, 7439.51643143194, 7442.144153422426, 7443.255674432514, 7448.776536703907, 6285.371462853861, 7103.467239957127, 7700.4224683150105, 8007.958965334469, 8123.8781418277595, 6962.77314401664, 7004.299570042955, 7084.645767711697, 7184.245654206442, 7197.1723251824615, 6640.0, 6697.229818570732, 6753.561018533779, 6789.015592739124, 6814.829629259309, 6552.83617909537, 6560.573562718408, 6585.242697089896, 6606.339366063356, 6619.0733297339375, 5021.447640759587, 5055.090083784954, 5119.718415487035, 5157.174852023658, 5169.759257778182, 5089.872753181052, 5166.638335316642, 5207.0, 5218.425973142876, 5236.293100431393], "value": 4474.862098319834, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [311.86901501369425, 367.90802299425144, 378.867396411256, 383.6374625978448, 387.94956655634763, 4931.457539670633, 5270.947290527093, 5329.253904453375, 5385.407605163438, 5480.0, 4860.538248866361, 5445.50990410863, 5489.807856725015, 5492.80775172869, 5517.724113794315, 4123.072308730541, 4268.530461649216, 4274.679399045069, 4310.245707001278, 4323.459567554056, 3545.166885781839, 3903.0, 3908.4528166056634, 4111.218868415007, 4321.395004699345, 3389.796632189072, 3834.559025712051, 3869.9032524186837, 4132.359484279927, 4145.0, 3609.4405367168133, 4113.4035564843225, 4130.504339479252, 4132.173565286939, 4146.688998325138, 3043.4065357255345, 3517.856696573598, 3617.6924961378313, 3630.7276954228273, 3636.5999740028574, 4361.781910904442, 5107.489251074863, 5298.178782288713, 5361.81233656824, 5407.405185429599, 4172.457580514514, 4772.0, 4792.808287668524, 4799.760011999421, 4806.0, 5253.921191182136, 5511.429242665821, 5599.796043850551, 5822.515258609028, 5843.561732870052, 3324.5511855899385, 3424.760266781326, 3661.0, 3893.9415908761393, 3961.465202197724, 5487.244081893796, 5570.1592187984015, 5652.98246315663, 6204.408737534237, 6254.968725156391, 3592.604813470516, 4034.7377420467574, 4063.2482990646827, 4072.8799580115115, 4077.0, 3612.6387361263664, 4003.319435695939, 4074.592540745961, 4096.201240758023, 4119.649829764444, 4759.333693282943, 4760.857174284777, 4765.73788441639, 4795.5853023358195, 4802.175173434072, 5883.529317654577, 5894.528437724972, 5910.645361278337, 5959.493443057302, 5974.880502390015, 1176.9823452648218, 1230.6615680687883, 1274.847018357803, 1296.507327215652, 1338.6921008168176, 823.9258466738022, 856.07543852639, 872.1583671756786, 902.0933961368783, 910.1490106750209, 4576.794044268016, 4883.072216278895, 5035.79856805731, 5174.076646694605, 5257.842264732064, 5750.741216645261, 5824.427404600734, 5829.446202610745, 5840.88318233633, 5854.541092741059, 4371.497277813092, 4447.599006313001, 4648.767561621906, 4679.461861885927, 5300.4945796073025, 2602.3624212067784, 2606.8175227734255, 2649.854258015789, 2947.0, 3049.6950304969328, 5046.823361182414, 5795.0, 5897.911531327033, 5982.0, 6004.849878752979, 5189.325387699575, 5482.835514934558, 5944.405559444021, 5959.731812068468, 6013.639181649115, 5107.131787596118, 5716.571257155647, 5965.747193089413, 5992.711567013113, 5996.781190959373, 5425.565954723692, 5583.804566840141, 5597.384287728428, 5755.7697692093525, 5808.593398462067, 5279.630425870152, 5314.734263286743, 5653.858653533694, 5711.543076553782, 5726.484616384545, 5479.0685583451705, 5613.0, 5917.467427931507, 6014.278286605635, 6029.668368239613, 3257.7556683248376, 3332.683395077464, 3343.9665603343656, 3686.8709595165114, 3856.672182864488, 4729.479757226771, 5426.891462170814, 5434.945650543602, 5612.522935550524, 5687.388508297178, 5696.715164241854, 5753.108268218432, 5850.97607918604, 5860.476276168312, 5861.0, 5568.91646625309, 5596.888062238651, 5832.996007056285, 5845.941540584709, 5854.590178687451, 5051.6716413433005, 5506.366767821752, 5549.694766787704, 5623.775048997994, 5693.544516438592, 5739.655620662774, 5825.330087039875, 5853.507355624289, 5858.414158584107, 5874.970625146847, 4763.785629646605, 5251.054810134213, 5722.084466485342, 5759.337676167127, 5772.39389864075], "value": 4157.201877839249, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [730.9415246780258, 739.9741009064684, 788.6293442082223, 796.4862663581989, 899.4108858697551, 15160.77258841117, 15489.14809685467, 15745.685086298266, 15887.84112158878, 15917.04497730137, 14525.78211326831, 14551.417943282282, 14661.486847960323, 14666.779998300008, 14670.779938300933, 885.6413152673161, 893.7720881175323, 897.6185121323444, 899.2715900120891, 900.995495022524, 719.7336985315441, 741.3920585120204, 875.4003507597284, 890.9376343655947, 894.8076163624819, 943.1888575824785, 954.8710924025272, 955.0258736089185, 956.942583444992, 958.0850287974968, 950.7147855643314, 951.1677282377954, 951.9476428796448, 952.3333666433455, 952.9904700953041, 691.6541729135432, 706.9010338552607, 708.3801673535656, 708.9042979197845, 709.1242315740056, 12458.563950261789, 15224.46714365003, 15276.159811210378, 15317.617059573487, 15581.766273505906, 14543.927280363636, 14824.777628335583, 14840.0, 14943.476978305816, 14970.70058598822, 11629.244099133613, 11660.242084264495, 11864.466099025565, 11906.46420911061, 11946.940265298705, 3756.4365345198166, 3827.0, 3857.4213867919757, 3871.2838124946975, 3901.6878649707955, 89450.0, 100971.0, 104355.0, 104740.47629761879, 105037.84886453343, 10721.946390267998, 11000.064994475559, 11150.163737719704, 11309.547618095185, 11374.31754094757, 18832.717509237373, 21345.0, 22117.778822211894, 22192.112315507522, 22523.774762252167, 7696.846063078707, 7795.376369890395, 7857.371410287164, 7894.960525197452, 7955.363570914313, 4292.5707429257445, 4319.8488052918, 4392.802323895432, 4399.73601583906, 4478.865634030984, 3566.179778650873, 3613.2231570212007, 3620.5655321361605, 3646.6171052039153, 3649.8905032849057, 577.7891069759592, 671.6238906212536, 674.1202730436729, 694.6214313199318, 698.8427603789107, 640.6700549217157, 642.922849258092, 649.8895187818082, 665.1153965226238, 666.9066330713704, 10221.897781022244, 10322.638707645196, 10353.119984801226, 10542.525586348633, 11165.330080195214, 586.571802584116, 599.9790007349721, 609.4667166229549, 663.7278715726529, 726.4043484342789, 4720.079584481062, 5141.3830340358645, 5191.428942816363, 5210.76551555181, 5211.921821172686, 88657.55671221603, 99559.50220248853, 103013.0, 104485.47757261318, 106644.0, 90292.5485372569, 92200.53899730458, 92668.07331926729, 92765.0, 93147.06852931519, 62821.37178628246, 74214.62892685502, 74613.50772984509, 75060.49879002389, 75629.24370756332, 10025.348352357074, 10135.0, 10155.593776248867, 10159.085682288629, 10168.898311016796, 48486.272705908734, 51681.224781629055, 52043.73978130085, 53510.66223344448, 53824.46175538351, 64666.0, 66034.33965660474, 67070.3292967064, 67172.32827671661, 69228.30771692218, 10256.38461692301, 10628.627998020032, 11729.120315976506, 12117.151799374311, 12382.380880956096, 10730.73173170677, 13278.269695166473, 13302.0, 13392.330383480592, 13529.526466573623, 12374.81437778416, 12527.624171274876, 12556.87443125557, 12594.24434533931, 12788.808167877676, 12338.444769985193, 12468.875311246771, 12586.685332866751, 12653.493860245488, 12757.362131893553, 11892.881071189177, 12283.263004219776, 12348.876511234772, 12349.444275007825, 12455.688607784516, 7956.726923692181, 9122.224610908148, 9257.444553326823, 9479.099485548863, 9711.181240762126, 9676.56455459492, 10217.795644087226, 10221.33561318512, 10231.13035392, 10246.590136394461], "value": 7435.8721118983085, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1521.7999999999997, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 115.0, 117.0, 119.0, 118.0, 120.0, 117.0, 117.0, 119.0, 119.0], "value": 116.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 141.0, 113.0, 145.0, 109.0, 114.0, 111.0, 109.0, 130.0, 110.0], "value": 125.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [197.0, 203.0, 196.0, 199.0, 197.0, 200.0, 196.0, 199.0, 197.0, 197.0], "value": 198.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 58.0, 59.0, 86.0, 58.0, 60.0, 60.0, 84.0, 71.0, 60.0], "value": 67.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 72.0, 86.0, 73.0, 69.0, 71.0, 93.0, 93.0, 71.0, 81.0], "value": 80.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 81.0, 136.0, 130.0, 92.0, 80.0, 131.0, 116.0, 115.0, 86.0], "value": 106.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 105.0, 101.0, 127.0, 171.0, 102.0, 103.0, 103.0, 102.0, 118.0], "value": 113.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 142.0, 114.0, 96.0, 92.0, 94.0, 96.0, 77.0, 142.0, 143.0], "value": 109.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 58.0, 58.0, 58.0, 61.0, 62.0, 60.0, 61.0, 60.0, 58.0], "value": 59.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 73.0, 68.0, 76.0, 72.0, 69.0, 67.0, 73.0, 66.0, 70.0], "value": 70.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 80.0, 88.0, 71.0, 90.0, 102.0, 99.0, 103.0, 105.0, 80.0], "value": 90.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [136.0, 135.0, 147.0, 139.0, 133.0, 143.0, 159.0, 154.0, 180.0, 135.0], "value": 146.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 164.0, 168.0, 172.0, 168.0, 166.0, 167.0, 167.0, 174.0, 147.0], "value": 166.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 67.0, 64.0, 66.0, 68.0, 82.0, 85.0, 90.0, 84.0], "value": 73.8, "unit": "score"}]}]} 14:35:51 INFO - Return code: 0 14:35:51 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 14:35:51 ERROR - # TBPL SUCCESS # 14:35:51 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 14:35:51 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 14:35:51 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 14:35:51 INFO - 2017-03-30 14:35:51.860 screenresolution[1919:13223] starting screenresolution argv=screenresolution get 14:35:51 INFO - 2017-03-30 14:35:51.863 screenresolution[1919:13223] Display 0: 1600x1200x32@60 14:35:51 INFO - 2017-03-30 14:35:51.869 screenresolution[1920:13226] starting screenresolution argv=screenresolution list 14:35:51 INFO - Available Modes on Display 0 14:35:51 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 14:35:51 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 14:35:51 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 14:35:51 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 14:35:52 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 14:35:52 INFO - Intel Iris: 14:35:52 INFO - Chipset Model: Intel Iris 14:35:52 INFO - Type: GPU 14:35:52 INFO - Bus: Built-In 14:35:52 INFO - VRAM (Dynamic, Max): 1536 MB 14:35:52 INFO - Vendor: Intel (0x8086) 14:35:52 INFO - Device ID: 0x0a2e 14:35:52 INFO - Revision ID: 0x0009 14:35:52 INFO - Displays: 14:35:52 INFO - Display: 14:35:52 INFO - Resolution: 1600 x 1200 @ 60 Hz 14:35:52 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 14:35:52 INFO - Display Serial Number: 1600x1200 60 14:35:52 INFO - Main Display: Yes 14:35:52 INFO - Mirror: Off 14:35:52 INFO - Online: Yes 14:35:52 INFO - Rotation: Supported 14:35:52 INFO - Return code: 0 14:35:52 INFO - Running post-action listener: _resource_record_post_action 14:35:52 INFO - [mozharness: 2017-03-30 21:35:52.102439Z] Finished run-tests step (success) 14:35:52 INFO - Running post-run listener: _resource_record_post_run 14:35:52 INFO - Total resource usage - Wall time: 1190s; CPU: 55.0%; Read bytes: 1766400; Write bytes: 421314560; Read time: 22; Write time: 1752 14:35:52 INFO - TinderboxPrint: CPU usage
54.5% 14:35:52 INFO - TinderboxPrint: I/O read bytes / time
1,766,400 / 22 14:35:52 INFO - TinderboxPrint: I/O write bytes / time
421,314,560 / 1,752 14:35:52 INFO - TinderboxPrint: CPU idle
2,165.5 (45.5%) 14:35:52 INFO - TinderboxPrint: CPU system
966.1 (20.3%) 14:35:52 INFO - TinderboxPrint: CPU user
1,630.0 (34.2%) 14:35:52 INFO - TinderboxPrint: Swap in / out
123,961,344 / 0 14:35:52 INFO - install - Wall time: 15s; CPU: 54.0%; Read bytes: 117031424; Write bytes: 112721920; Read time: 11134; Write time: 226 14:35:52 INFO - run-tests - Wall time: 1176s; CPU: 55.0%; Read bytes: 1766400; Write bytes: 297848832; Read time: 22; Write time: 1491 14:35:52 INFO - Running post-run listener: _upload_blobber_files 14:35:52 INFO - Blob upload gear active. 14:35:52 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 14:35:52 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 14:35:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 14:35:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 14:35:52 INFO - (blobuploader) - INFO - Open directory for files ... 14:35:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 14:35:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:35:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:35:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 14:35:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:35:53 INFO - (blobuploader) - INFO - Done attempting. 14:35:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 14:35:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:35:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:35:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 14:35:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:35:54 INFO - (blobuploader) - INFO - Done attempting. 14:35:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 14:35:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:35:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:35:56 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 14:35:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:35:56 INFO - (blobuploader) - INFO - Done attempting. 14:35:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 14:35:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:35:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:35:59 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 14:35:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:35:59 INFO - (blobuploader) - INFO - Done attempting. 14:35:59 INFO - (blobuploader) - INFO - Iteration through files over. 14:35:59 INFO - Return code: 0 14:35:59 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 14:35:59 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 14:35:59 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0456b23fc8c65e1bad3b48d3439d6b9e06f440cfa7532f9390e4ff46190c5cef59fb96c658789df512966962d85d52f411c55f350b1bf25fd314f2ddeaaef378", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f6b00c0c682ef70b119dbc62a0dd5f25beedb3e3f68c840b74b03384dc8bbf7e2a7d232a9bc56826cc55b712c69d75963bdfc89917dccc86256e560739f8c1ca", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/04cb125fd7375824b9dade74e6dfc80bf94eeaa5a8dffa744930a946387a8f454dad085f076b09eff01f4ee193b32ea03f347435e05a633b3dc4a74588fcc061", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/c717e8db5b6d66b778471d412d9453af9818e6101d14d4b7375f80d57238793c479de0f84e64702a72cd68c3ffb099bae8b84b0b70fe65045e6a1460c57400ae"} 14:35:59 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 14:35:59 INFO - Writing to file /builds/slave/test/properties/blobber_files 14:35:59 INFO - Contents: 14:35:59 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0456b23fc8c65e1bad3b48d3439d6b9e06f440cfa7532f9390e4ff46190c5cef59fb96c658789df512966962d85d52f411c55f350b1bf25fd314f2ddeaaef378", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f6b00c0c682ef70b119dbc62a0dd5f25beedb3e3f68c840b74b03384dc8bbf7e2a7d232a9bc56826cc55b712c69d75963bdfc89917dccc86256e560739f8c1ca", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/04cb125fd7375824b9dade74e6dfc80bf94eeaa5a8dffa744930a946387a8f454dad085f076b09eff01f4ee193b32ea03f347435e05a633b3dc4a74588fcc061", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/c717e8db5b6d66b778471d412d9453af9818e6101d14d4b7375f80d57238793c479de0f84e64702a72cd68c3ffb099bae8b84b0b70fe65045e6a1460c57400ae"} 14:35:59 INFO - Running post-run listener: copy_logs_to_upload_dir 14:35:59 INFO - Copying logs to upload dir... 14:35:59 INFO - mkdir: /builds/slave/test/build/upload/logs 14:35:59 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1251.585586 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2017-03-30 14:35:59.217492) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-30 14:35:59.220835) ========= 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.ksArFS0LiB/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.seOdekMOru/Listeners TMPDIR=/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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-Beta/sha512/0456b23fc8c65e1bad3b48d3439d6b9e06f440cfa7532f9390e4ff46190c5cef59fb96c658789df512966962d85d52f411c55f350b1bf25fd314f2ddeaaef378", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f6b00c0c682ef70b119dbc62a0dd5f25beedb3e3f68c840b74b03384dc8bbf7e2a7d232a9bc56826cc55b712c69d75963bdfc89917dccc86256e560739f8c1ca", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/04cb125fd7375824b9dade74e6dfc80bf94eeaa5a8dffa744930a946387a8f454dad085f076b09eff01f4ee193b32ea03f347435e05a633b3dc4a74588fcc061", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/c717e8db5b6d66b778471d412d9453af9818e6101d14d4b7375f80d57238793c479de0f84e64702a72cd68c3ffb099bae8b84b0b70fe65045e6a1460c57400ae"} build_url:https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011364 build_url: 'https://queue.taskcluster.net/v1/task/FZnecyPcSui5Yo0HLDNHjg/artifacts/public/build/firefox-53.0.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0456b23fc8c65e1bad3b48d3439d6b9e06f440cfa7532f9390e4ff46190c5cef59fb96c658789df512966962d85d52f411c55f350b1bf25fd314f2ddeaaef378", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f6b00c0c682ef70b119dbc62a0dd5f25beedb3e3f68c840b74b03384dc8bbf7e2a7d232a9bc56826cc55b712c69d75963bdfc89917dccc86256e560739f8c1ca", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/04cb125fd7375824b9dade74e6dfc80bf94eeaa5a8dffa744930a946387a8f454dad085f076b09eff01f4ee193b32ea03f347435e05a633b3dc4a74588fcc061", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/c717e8db5b6d66b778471d412d9453af9818e6101d14d4b7375f80d57238793c479de0f84e64702a72cd68c3ffb099bae8b84b0b70fe65045e6a1460c57400ae"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-30 14:35:59.260414) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-30 14:35:59.261153) ========= 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.ksArFS0LiB/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.seOdekMOru/Listeners TMPDIR=/var/folders/wq/k1fxgwns1ls22g4fg828fjf400000w/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.005384 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-30 14:35:59.314472) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-30 14:35:59.315244) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-30 14:35:59.315997) ========= ========= Total master_lag: 0.20 =========