builder: mozilla-aurora_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0371 starttime: 1478100926.53 results: success (0) buildid: 20161102061118 builduid: bfc793a05b574833b7070813baac1de3 revision: 7959c8deda49fe57e5788a9b11febc5d7f896814 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:26.531171) ========= master: http://buildbot-master134.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:26.531650) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:26.531950) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:26.558043) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:26.558408) ========= 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.SSsbR8AGKN/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.VAfti0hYAO/Listeners TMPDIR=/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-11-02 08:35:26-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 13.0M=0.001s 2016-11-02 08:35:26 (13.0 MB/s) - 'archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.088200 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:26.670021) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:26.670351) ========= 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.SSsbR8AGKN/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.VAfti0hYAO/Listeners TMPDIR=/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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.025493 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:26.719607) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-11-02 08:35:26.719992) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 7959c8deda49fe57e5788a9b11febc5d7f896814 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 7959c8deda49fe57e5788a9b11febc5d7f896814 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.SSsbR8AGKN/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.VAfti0hYAO/Listeners TMPDIR=/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-11-02 08:35:26,858 truncating revision to first 12 chars 2016-11-02 08:35:26,858 Setting DEBUG logging. 2016-11-02 08:35:26,859 attempt 1/10 2016-11-02 08:35:26,859 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/7959c8deda49?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-11-02 08:35:28,370 unpacking tar archive at: mozilla-aurora-7959c8deda49/testing/mozharness/ program finished with exit code 0 elapsedTime=1.786192 ========= master_lag: 1.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-11-02 08:35:29.536752) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:29.537097) ========= script_repo_revision: 7959c8deda49fe57e5788a9b11febc5d7f896814 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:29.537562) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:29.537838) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-02 08:35:29.560925) ========= ========= Started '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2016-11-02 08:35:29.561305) ========= /tools/buildbot/bin/python -u scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', '-u', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.SSsbR8AGKN/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.VAfti0hYAO/Listeners TMPDIR=/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:35:29 INFO - MultiFileLogger online at 20161102 08:35:29 in /builds/slave/test 08:35:29 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 08:35:29 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:35:29 INFO - {'append_to_log': False, 08:35:29 INFO - 'base_work_dir': '/builds/slave/test', 08:35:29 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:35:29 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:35:29 INFO - 'branch': 'Mozilla-Aurora', 08:35:29 INFO - 'buildbot_json_path': 'buildprops.json', 08:35:29 INFO - 'config_files': ('talos/mac_config.py',), 08:35:29 INFO - 'default_actions': ('clobber', 08:35:29 INFO - 'read-buildbot-config', 08:35:29 INFO - 'download-and-extract', 08:35:29 INFO - 'populate-webroot', 08:35:29 INFO - 'create-virtualenv', 08:35:29 INFO - 'install', 08:35:29 INFO - 'run-tests'), 08:35:29 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:35:29 INFO - 'download_minidump_stackwalk': True, 08:35:29 INFO - 'download_symbols': 'ondemand', 08:35:29 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:35:29 INFO - 'tooltool.py': '/tools/tooltool.py', 08:35:29 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:35:29 INFO - '/tools/misc-python/virtualenv.py')}, 08:35:29 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:35:29 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:35:29 INFO - 'installer_path': 'installer.exe', 08:35:29 INFO - 'log_level': 'info', 08:35:29 INFO - 'log_name': 'talos', 08:35:29 INFO - 'log_to_console': True, 08:35:29 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 08:35:29 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 08:35:29 INFO - 'opt_config_files': (), 08:35:29 INFO - 'pip_index': False, 08:35:29 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:35:29 INFO - 'cmd': ('bash', 08:35:29 INFO - '-c', 08:35:29 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:35:29 INFO - 'enabled': True, 08:35:29 INFO - 'halt_on_failure': False, 08:35:29 INFO - 'name': 'check_screen_resolution'},), 08:35:29 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:35:29 INFO - 'cmd': ('bash', 08:35:29 INFO - '-c', 08:35:29 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:35:29 INFO - 'enabled': True, 08:35:29 INFO - 'halt_on_failure': False, 08:35:29 INFO - 'name': 'check_screen_resolution'},), 08:35:29 INFO - 'run_cmd_checks_enabled': True, 08:35:29 INFO - 'sps_profile': False, 08:35:29 INFO - 'sps_profile_interval': 0, 08:35:29 INFO - 'suite': 'dromaeojs-e10s', 08:35:29 INFO - 'system_bits': '32', 08:35:29 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:35:29 INFO - 'title': 't-yosemite-r7-0371', 08:35:29 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:35:29 INFO - 'use_talos_json': True, 08:35:29 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:35:29 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:35:29 INFO - 'work_dir': 'build'} 08:35:29 INFO - [mozharness: 2016-11-02 15:35:29.814993Z] Running clobber step. 08:35:29 INFO - Running pre-action listener: _resource_record_pre_action 08:35:29 INFO - Running main action method: clobber 08:35:29 INFO - rmtree: /builds/slave/test/build 08:35:29 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:35:31 INFO - Running post-action listener: _resource_record_post_action 08:35:31 INFO - [mozharness: 2016-11-02 15:35:31.946038Z] Finished clobber step (success) 08:35:31 INFO - [mozharness: 2016-11-02 15:35:31.946224Z] Running read-buildbot-config step. 08:35:31 INFO - Running pre-action listener: _resource_record_pre_action 08:35:31 INFO - Running main action method: read_buildbot_config 08:35:31 INFO - Using buildbot properties: 08:35:31 INFO - { 08:35:31 INFO - "project": "", 08:35:31 INFO - "product": "firefox", 08:35:31 INFO - "script_repo_revision": "production", 08:35:31 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs-e10s", 08:35:31 INFO - "repository": "", 08:35:31 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs-e10s", 08:35:31 INFO - "buildid": "20161102061118", 08:35:31 INFO - "pgo_build": "False", 08:35:31 INFO - "basedir": "/builds/slave/test", 08:35:31 INFO - "buildnumber": 8, 08:35:31 INFO - "slavename": "t-yosemite-r7-0371", 08:35:31 INFO - "master": "http://buildbot-master134.bb.releng.scl3.mozilla.com:8201/", 08:35:31 INFO - "platform": "yosemite_r7", 08:35:31 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 08:35:31 INFO - "branch": "mozilla-aurora", 08:35:31 INFO - "repo_path": "releases/mozilla-aurora", 08:35:31 INFO - "revision": "7959c8deda49fe57e5788a9b11febc5d7f896814", 08:35:31 INFO - "stage_platform": "macosx64", 08:35:31 INFO - "builduid": "bfc793a05b574833b7070813baac1de3", 08:35:31 INFO - "slavebuilddir": "test" 08:35:31 INFO - } 08:35:31 INFO - Found installer url https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg. 08:35:31 INFO - Running post-action listener: _resource_record_post_action 08:35:31 INFO - [mozharness: 2016-11-02 15:35:31.949507Z] Finished read-buildbot-config step (success) 08:35:31 INFO - [mozharness: 2016-11-02 15:35:31.949634Z] Running download-and-extract step. 08:35:31 INFO - Running pre-action listener: _resource_record_pre_action 08:35:31 INFO - Running main action method: download_and_extract 08:35:31 INFO - mkdir: /builds/slave/test/build/tests 08:35:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:35:31 INFO - trying https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json 08:35:31 INFO - Downloading https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 08:35:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json'}, attempt #1 08:35:32 INFO - Downloaded 1199 bytes. 08:35:32 INFO - Reading from file /builds/slave/test/build/firefox-51.0a2.en-US.mac.test_packages.json 08:35:32 INFO - Using the following test package requirements: 08:35:32 INFO - {u'common': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 08:35:32 INFO - u'cppunittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:35:32 INFO - u'firefox-51.0a2.en-US.mac.cppunittest.tests.zip'], 08:35:32 INFO - u'gtest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:35:32 INFO - u'firefox-51.0a2.en-US.mac.gtest.tests.zip'], 08:35:32 INFO - u'jittest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:35:32 INFO - u'jsshell-mac.zip'], 08:35:32 INFO - u'mochitest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:35:32 INFO - u'firefox-51.0a2.en-US.mac.mochitest.tests.zip'], 08:35:32 INFO - u'mozbase': [u'firefox-51.0a2.en-US.mac.common.tests.zip'], 08:35:32 INFO - u'reftest': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:35:32 INFO - u'firefox-51.0a2.en-US.mac.reftest.tests.zip'], 08:35:32 INFO - u'talos': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:35:32 INFO - u'firefox-51.0a2.en-US.mac.talos.tests.zip'], 08:35:32 INFO - u'web-platform': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:35:32 INFO - u'firefox-51.0a2.en-US.mac.web-platform.tests.zip'], 08:35:32 INFO - u'xpcshell': [u'firefox-51.0a2.en-US.mac.common.tests.zip', 08:35:32 INFO - u'firefox-51.0a2.en-US.mac.xpcshell.tests.zip']} 08:35:32 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip'] for test suite category: common 08:35:32 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 08:35:32 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 08:35:32 INFO - Fetch https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 08:35:33 INFO - Expected file size: 16421551 08:35:40 INFO - Downloading packages: [u'firefox-51.0a2.en-US.mac.common.tests.zip', u'firefox-51.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 08:35:40 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip 08:35:40 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip'}, attempt #1 08:35:40 INFO - Fetch https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.common.tests.zip into memory 08:35:41 INFO - Expected file size: 16421551 08:35:47 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip 08:35:47 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip'}, attempt #1 08:35:47 INFO - Fetch https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.talos.tests.zip into memory 08:35:48 INFO - Expected file size: 14414089 08:35:49 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')]} 08:35:49 INFO - trying https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 08:35:49 INFO - Downloading https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg 08:35:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg'}, attempt #1 08:35:52 INFO - Downloaded 115433871 bytes. 08:35:52 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 08:35:52 INFO - mkdir: /builds/slave/test/properties 08:35:52 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:35:52 INFO - Writing to file /builds/slave/test/properties/build_url 08:35:52 INFO - Contents: 08:35:52 INFO - build_url:https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg 08:35:52 INFO - Running post-action listener: _resource_record_post_action 08:35:52 INFO - Running post-action listener: set_extra_try_arguments 08:35:52 INFO - [mozharness: 2016-11-02 15:35:52.955211Z] Finished download-and-extract step (success) 08:35:52 INFO - [mozharness: 2016-11-02 15:35:52.955356Z] Running populate-webroot step. 08:35:52 INFO - Running pre-action listener: _resource_record_pre_action 08:35:52 INFO - Running main action method: populate_webroot 08:35:52 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:35:52 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:35:52 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:35:52 INFO - '--tppagecycles', 08:35:52 INFO - '7'], 08:35:52 INFO - 'tests': ['tsvgm']}}, 08:35:52 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:35:52 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:35:52 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:35:52 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:35:52 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:35:52 INFO - 'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:35:52 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:35:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:35:52 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:35:52 INFO - 'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['damp', 'tps']}, 08:35:52 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:35:52 INFO - 'tests': ['damp', 'tps']}, 08:35:52 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['dromaeo_dom']}, 08:35:52 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:35:52 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['basic_compositor_video']}, 08:35:52 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:35:52 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['a11yr', 08:35:52 INFO - 'ts_paint', 08:35:52 INFO - 'tpaint', 08:35:52 INFO - 'sessionrestore', 08:35:52 INFO - 'sessionrestore_no_auto_restore', 08:35:52 INFO - 'tabpaint']}, 08:35:52 INFO - 'other-e10s': {'tests': ['a11yr', 08:35:52 INFO - 'ts_paint', 08:35:52 INFO - 'tpaint', 08:35:52 INFO - 'sessionrestore', 08:35:52 INFO - 'sessionrestore_no_auto_restore', 08:35:52 INFO - 'tabpaint']}, 08:35:52 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:35:52 INFO - 'ts_paint', 08:35:52 INFO - 'tpaint', 08:35:52 INFO - 'sessionrestore', 08:35:52 INFO - 'sessionrestore_no_auto_restore', 08:35:52 INFO - 'tabpaint']}, 08:35:52 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:35:52 INFO - 'ts_paint', 08:35:52 INFO - 'tpaint', 08:35:52 INFO - 'sessionrestore', 08:35:52 INFO - 'sessionrestore_no_auto_restore', 08:35:52 INFO - 'tabpaint']}, 08:35:52 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['a11yr', 08:35:52 INFO - 'ts_paint', 08:35:52 INFO - 'tpaint', 08:35:52 INFO - 'sessionrestore', 08:35:52 INFO - 'sessionrestore_no_auto_restore', 08:35:52 INFO - 'tabpaint']}, 08:35:52 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['a11yr', 08:35:52 INFO - 'ts_paint', 08:35:52 INFO - 'tpaint', 08:35:52 INFO - 'sessionrestore', 08:35:52 INFO - 'sessionrestore_no_auto_restore', 08:35:52 INFO - 'tabpaint']}, 08:35:52 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['tsvgx', 08:35:52 INFO - 'tsvgr_opacity', 08:35:52 INFO - 'tart', 08:35:52 INFO - 'tscrollx', 08:35:52 INFO - 'cart']}, 08:35:52 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:35:52 INFO - 'tsvgr_opacity', 08:35:52 INFO - 'tart', 08:35:52 INFO - 'tscrollx', 08:35:52 INFO - 'cart']}, 08:35:52 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:35:52 INFO - 'talos_options': ['--disable-e10s'], 08:35:52 INFO - 'tests': ['tp5o']}, 08:35:52 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:35:52 INFO - 'tests': ['tp5o']}, 08:35:52 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:35:52 INFO - 'talos_options': ['--disable-e10s', 08:35:52 INFO - '--xperf_path', 08:35:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:35:52 INFO - 'tests': ['tp5n']}, 08:35:52 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:35:52 INFO - 'talos_options': ['--xperf_path', 08:35:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:35:52 INFO - 'tests': ['tp5n']}}, 08:35:52 INFO - 'talos.zip': {'path': '', 08:35:52 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:35:52 INFO - Running post-action listener: _resource_record_post_action 08:35:52 INFO - [mozharness: 2016-11-02 15:35:52.974117Z] Finished populate-webroot step (success) 08:35:52 INFO - [mozharness: 2016-11-02 15:35:52.974216Z] Running create-virtualenv step. 08:35:52 INFO - Running pre-action listener: _resource_record_pre_action 08:35:52 INFO - Running main action method: create_virtualenv 08:35:52 INFO - Creating virtualenv /builds/slave/test/build/venv 08:35:52 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 08:35:52 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:35:53 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:35:53 INFO - Using real prefix '/tools/python27' 08:35:53 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:35:53 INFO - Installing distribute.............................................................................................................................................................................................done. 08:35:56 INFO - Installing pip.................done. 08:35:56 INFO - Return code: 0 08:35:56 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:35:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:35:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:35:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:35:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:35:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:35:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:35:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:35:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 08:35:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 08:35:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:35:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:35:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:35:56 INFO - 'HOME': '/Users/cltbld', 08:35:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:35:56 INFO - 'LOGNAME': 'cltbld', 08:35:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:35:56 INFO - 'MOZ_NO_REMOTE': '1', 08:35:56 INFO - 'NO_EM_RESTART': '1', 08:35:56 INFO - 'PAGER': '/bin/cat', 08:35:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:35:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:35:56 INFO - 'PWD': '/builds/slave/test', 08:35:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:35:56 INFO - 'SHELL': '/bin/bash', 08:35:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:35:56 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:35:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:35:56 INFO - 'USER': 'cltbld', 08:35:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:35:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:35:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:35:56 INFO - 'XPC_FLAGS': '0x0', 08:35:56 INFO - 'XPC_SERVICE_NAME': '0', 08:35:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:35:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:35:56 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 08:35:56 INFO - Cleaning up... 08:35:56 INFO - Return code: 0 08:35:56 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:35:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:35:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:35:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:35:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:35:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:35:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:35:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:35:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 08:35:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 08:35:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:35:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:35:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:35:56 INFO - 'HOME': '/Users/cltbld', 08:35:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:35:56 INFO - 'LOGNAME': 'cltbld', 08:35:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:35:56 INFO - 'MOZ_NO_REMOTE': '1', 08:35:56 INFO - 'NO_EM_RESTART': '1', 08:35:56 INFO - 'PAGER': '/bin/cat', 08:35:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:35:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:35:56 INFO - 'PWD': '/builds/slave/test', 08:35:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:35:56 INFO - 'SHELL': '/bin/bash', 08:35:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:35:56 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:35:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:35:56 INFO - 'USER': 'cltbld', 08:35:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:35:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:35:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:35:56 INFO - 'XPC_FLAGS': '0x0', 08:35:56 INFO - 'XPC_SERVICE_NAME': '0', 08:35:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:35:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:35:57 INFO - Downloading/unpacking psutil>=3.1.1 08:35: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 08:35: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 08:35: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 08:35: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 08:35: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 08:35: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 08:36:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:36:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:36:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:36:00 INFO - Installing collected packages: psutil 08:36:00 INFO - Running setup.py install for psutil 08:36:00 INFO - building 'psutil._psutil_osx' extension 08:36:00 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 08:36:00 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 08:36:00 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 08:36:01 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 08:36:01 INFO - building 'psutil._psutil_posix' extension 08:36:01 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 08:36:01 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 08:36:01 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 08:36:01 INFO - ^ 08:36:01 INFO - 1 warning generated. 08:36:01 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 08:36:01 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:36:01 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:36:01 INFO - Successfully installed psutil 08:36:01 INFO - Cleaning up... 08:36:01 INFO - Return code: 0 08:36:01 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:36:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:36:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 08:36:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 08:36:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:01 INFO - 'HOME': '/Users/cltbld', 08:36:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:01 INFO - 'LOGNAME': 'cltbld', 08:36:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:01 INFO - 'MOZ_NO_REMOTE': '1', 08:36:01 INFO - 'NO_EM_RESTART': '1', 08:36:01 INFO - 'PAGER': '/bin/cat', 08:36:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:01 INFO - 'PWD': '/builds/slave/test', 08:36:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:01 INFO - 'SHELL': '/bin/bash', 08:36:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:01 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:01 INFO - 'USER': 'cltbld', 08:36:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:01 INFO - 'XPC_FLAGS': '0x0', 08:36:01 INFO - 'XPC_SERVICE_NAME': '0', 08:36:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:01 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:36:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:04 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:36:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:36:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:36:04 INFO - Installing collected packages: mozsystemmonitor 08:36:04 INFO - Running setup.py install for mozsystemmonitor 08:36:04 INFO - Successfully installed mozsystemmonitor 08:36:04 INFO - Cleaning up... 08:36:04 INFO - Return code: 0 08:36:04 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:36:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:36:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 08:36:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 08:36:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:04 INFO - 'HOME': '/Users/cltbld', 08:36:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:04 INFO - 'LOGNAME': 'cltbld', 08:36:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:04 INFO - 'MOZ_NO_REMOTE': '1', 08:36:04 INFO - 'NO_EM_RESTART': '1', 08:36:04 INFO - 'PAGER': '/bin/cat', 08:36:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:04 INFO - 'PWD': '/builds/slave/test', 08:36:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:04 INFO - 'SHELL': '/bin/bash', 08:36:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:04 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:04 INFO - 'USER': 'cltbld', 08:36:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:04 INFO - 'XPC_FLAGS': '0x0', 08:36:04 INFO - 'XPC_SERVICE_NAME': '0', 08:36:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:04 INFO - Downloading/unpacking jsonschema==2.5.1 08:36:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:07 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:36:07 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:36:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:07 INFO - Downloading functools32-3.2.3-2.tar.gz 08:36:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:36:07 INFO - warning: no files found matching '*.txt' 08:36:07 INFO - no previously-included directories found matching 'build' 08:36:07 INFO - no previously-included directories found matching 'dist' 08:36:07 INFO - no previously-included directories found matching '.git*' 08:36:07 INFO - Installing collected packages: jsonschema, functools32 08:36:07 INFO - Running setup.py install for functools32 08:36:08 INFO - warning: no files found matching '*.txt' 08:36:08 INFO - no previously-included directories found matching 'build' 08:36:08 INFO - no previously-included directories found matching 'dist' 08:36:08 INFO - no previously-included directories found matching '.git*' 08:36:08 INFO - Successfully installed jsonschema functools32 08:36:08 INFO - Cleaning up... 08:36:08 INFO - Return code: 0 08:36:08 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:36:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:36:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 08:36:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 08:36:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:08 INFO - 'HOME': '/Users/cltbld', 08:36:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:08 INFO - 'LOGNAME': 'cltbld', 08:36:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:08 INFO - 'MOZ_NO_REMOTE': '1', 08:36:08 INFO - 'NO_EM_RESTART': '1', 08:36:08 INFO - 'PAGER': '/bin/cat', 08:36:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:08 INFO - 'PWD': '/builds/slave/test', 08:36:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:08 INFO - 'SHELL': '/bin/bash', 08:36:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:08 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:08 INFO - 'USER': 'cltbld', 08:36:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:08 INFO - 'XPC_FLAGS': '0x0', 08:36:08 INFO - 'XPC_SERVICE_NAME': '0', 08:36:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:08 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:36:08 INFO - Cleaning up... 08:36:08 INFO - Return code: 0 08:36:08 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:36:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:36:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:36:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:36:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:08 INFO - 'HOME': '/Users/cltbld', 08:36:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:08 INFO - 'LOGNAME': 'cltbld', 08:36:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:08 INFO - 'MOZ_NO_REMOTE': '1', 08:36:08 INFO - 'NO_EM_RESTART': '1', 08:36:08 INFO - 'PAGER': '/bin/cat', 08:36:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:08 INFO - 'PWD': '/builds/slave/test', 08:36:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:08 INFO - 'SHELL': '/bin/bash', 08:36:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:08 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:08 INFO - 'USER': 'cltbld', 08:36:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:08 INFO - 'XPC_FLAGS': '0x0', 08:36:08 INFO - 'XPC_SERVICE_NAME': '0', 08:36:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:08 INFO - Downloading/unpacking blobuploader==1.2.4 08:36:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:11 INFO - Downloading blobuploader-1.2.4.tar.gz 08:36:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:36:11 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:36:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:36:11 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:36:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:12 INFO - Downloading docopt-0.6.1.tar.gz 08:36:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:36:12 INFO - Installing collected packages: blobuploader, requests, docopt 08:36:12 INFO - Running setup.py install for blobuploader 08:36:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:36:12 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:36:12 INFO - Running setup.py install for requests 08:36:13 INFO - Running setup.py install for docopt 08:36:13 INFO - Successfully installed blobuploader requests docopt 08:36:13 INFO - Cleaning up... 08:36:13 INFO - Return code: 0 08:36:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:36:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:36:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:36:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:36:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:13 INFO - 'HOME': '/Users/cltbld', 08:36:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:13 INFO - 'LOGNAME': 'cltbld', 08:36:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:13 INFO - 'MOZ_NO_REMOTE': '1', 08:36:13 INFO - 'NO_EM_RESTART': '1', 08:36:13 INFO - 'PAGER': '/bin/cat', 08:36:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:13 INFO - 'PWD': '/builds/slave/test', 08:36:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:13 INFO - 'SHELL': '/bin/bash', 08:36:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:13 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:13 INFO - 'USER': 'cltbld', 08:36:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:13 INFO - 'XPC_FLAGS': '0x0', 08:36:13 INFO - 'XPC_SERVICE_NAME': '0', 08:36:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:36:13 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-vRP8Ue-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:36:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:36:13 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-yg4ipj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:36:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:36:13 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-qKk6jT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:36:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:36:13 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-jL_C2c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-7NwlD5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-vVrynf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-VeoVtx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-zeJhNb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-gFVTSu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-MkEM6k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-lJSQyv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-aV7mVy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:36:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:36:14 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-3giAc6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:36:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:36:15 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-QJzyzC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:36:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:36:15 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-58VMrz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:36:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:36:15 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-K9oYEa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:36:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:36:15 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-tEPpIV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:36:15 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:36:15 INFO - Running setup.py install for manifestparser 08:36:15 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:36:15 INFO - Running setup.py install for mozcrash 08:36:15 INFO - Running setup.py install for mozdebug 08:36:15 INFO - Running setup.py install for mozdevice 08:36:16 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Running setup.py install for mozfile 08:36:16 INFO - Running setup.py install for mozhttpd 08:36:16 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Running setup.py install for mozinfo 08:36:16 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Running setup.py install for mozInstall 08:36:16 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Running setup.py install for mozleak 08:36:16 INFO - Running setup.py install for mozlog 08:36:16 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:36:16 INFO - Running setup.py install for moznetwork 08:36:17 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:36:17 INFO - Running setup.py install for mozprocess 08:36:17 INFO - Running setup.py install for mozprofile 08:36:17 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:36:17 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:36:17 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:36:17 INFO - Running setup.py install for mozrunner 08:36:17 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:36:17 INFO - Running setup.py install for mozscreenshot 08:36:17 INFO - Running setup.py install for moztest 08:36:17 INFO - Running setup.py install for mozversion 08:36:17 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:36:18 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:36:18 INFO - Cleaning up... 08:36:18 INFO - Return code: 0 08:36:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:36:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:36:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:36:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:36:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:18 INFO - 'HOME': '/Users/cltbld', 08:36:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:18 INFO - 'LOGNAME': 'cltbld', 08:36:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:18 INFO - 'MOZ_NO_REMOTE': '1', 08:36:18 INFO - 'NO_EM_RESTART': '1', 08:36:18 INFO - 'PAGER': '/bin/cat', 08:36:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:18 INFO - 'PWD': '/builds/slave/test', 08:36:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:18 INFO - 'SHELL': '/bin/bash', 08:36:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:18 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:18 INFO - 'USER': 'cltbld', 08:36:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:18 INFO - 'XPC_FLAGS': '0x0', 08:36:18 INFO - 'XPC_SERVICE_NAME': '0', 08:36:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:36:18 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-pXvOx4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:36:18 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:36:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:36:18 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-QF5ZyU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:36:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:36:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:36:18 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-JnrcxL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:36:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:36:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:36:18 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-7FhKKa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:36:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:36:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:36:18 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-0rVzum-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:36:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:36:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:36:18 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-nBXvd1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:36:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 08:36:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:36:18 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-mJ4_Ya-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-4vzigR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-YT4Y57-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-qIZiyI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-bSoxio-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-i7JOSW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-VYSozt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-EkvskO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-ZsJeLZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:36:19 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-E85wwa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:36:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:36:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:36:20 INFO - Running setup.py (path:/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/pip-bWf73S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:36:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:36:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:36:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:36:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:36:20 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:36:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:36:20 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:36:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:22 INFO - Downloading blessings-1.6.tar.gz 08:36:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:36:22 INFO - Installing collected packages: blessings 08:36:22 INFO - Running setup.py install for blessings 08:36:22 INFO - Successfully installed blessings 08:36:22 INFO - Cleaning up... 08:36:23 INFO - Return code: 0 08:36:23 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:36:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:36:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:36:23 INFO - Reading from file tmpfile_stdout 08:36:23 INFO - Current package versions: 08:36:23 INFO - blessings == 1.6 08:36:23 INFO - blobuploader == 1.2.4 08:36:23 INFO - docopt == 0.6.1 08:36:23 INFO - functools32 == 3.2.3-2 08:36:23 INFO - jsonschema == 2.5.1 08:36:23 INFO - manifestparser == 1.1 08:36:23 INFO - mozInstall == 1.12 08:36:23 INFO - mozcrash == 0.17 08:36:23 INFO - mozdebug == 0.1 08:36:23 INFO - mozdevice == 0.48 08:36:23 INFO - mozfile == 1.2 08:36:23 INFO - mozhttpd == 0.7 08:36:23 INFO - mozinfo == 0.9 08:36:23 INFO - mozleak == 0.1 08:36:23 INFO - mozlog == 3.4 08:36:23 INFO - moznetwork == 0.27 08:36:23 INFO - mozprocess == 0.23 08:36:23 INFO - mozprofile == 0.28 08:36:23 INFO - mozrunner == 6.12 08:36:23 INFO - mozscreenshot == 0.1 08:36:23 INFO - mozsystemmonitor == 0.3 08:36:23 INFO - moztest == 0.7 08:36:23 INFO - mozversion == 1.4 08:36:23 INFO - psutil == 3.1.1 08:36:23 INFO - requests == 1.2.3 08:36:23 INFO - wsgiref == 0.1.2 08:36:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:36:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:24 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')]} 08:36:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:24 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 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:36:24 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 08:36:24 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 08:36:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:24 INFO - 'HOME': '/Users/cltbld', 08:36:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:24 INFO - 'LOGNAME': 'cltbld', 08:36:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:24 INFO - 'MOZ_NO_REMOTE': '1', 08:36:24 INFO - 'NO_EM_RESTART': '1', 08:36:24 INFO - 'PAGER': '/bin/cat', 08:36:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:24 INFO - 'PWD': '/builds/slave/test', 08:36:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:24 INFO - 'SHELL': '/bin/bash', 08:36:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:24 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:24 INFO - 'USER': 'cltbld', 08:36:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:24 INFO - 'XPC_FLAGS': '0x0', 08:36:24 INFO - 'XPC_SERVICE_NAME': '0', 08:36:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 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)) 08:36:24 INFO - Cleaning up... 08:36:24 INFO - Return code: 0 08:36:24 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:36:24 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')]} 08:36:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:24 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')]} 08:36:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:24 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 0x1017d1490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x101747570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f96caca6380>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, '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.SSsbR8AGKN/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.VAfti0hYAO/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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 08:36:24 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 08:36:24 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 08:36:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:24 INFO - 'HOME': '/Users/cltbld', 08:36:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:24 INFO - 'LOGNAME': 'cltbld', 08:36:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:24 INFO - 'MOZ_NO_REMOTE': '1', 08:36:24 INFO - 'NO_EM_RESTART': '1', 08:36:24 INFO - 'PAGER': '/bin/cat', 08:36:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:24 INFO - 'PWD': '/builds/slave/test', 08:36:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:24 INFO - 'SHELL': '/bin/bash', 08:36:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:24 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:24 INFO - 'USER': 'cltbld', 08:36:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:24 INFO - 'XPC_FLAGS': '0x0', 08:36:24 INFO - 'XPC_SERVICE_NAME': '0', 08:36:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:24 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:36:24 INFO - Cleaning up... 08:36:24 INFO - Return code: 0 08:36:24 INFO - Running post-action listener: _resource_record_post_action 08:36:24 INFO - Running post-action listener: _start_resource_monitoring 08:36:24 INFO - Starting resource monitoring. 08:36:24 INFO - [mozharness: 2016-11-02 15:36:24.702931Z] Finished create-virtualenv step (success) 08:36:24 INFO - [mozharness: 2016-11-02 15:36:24.703897Z] Running install step. 08:36:24 INFO - Running pre-action listener: _resource_record_pre_action 08:36:24 INFO - Running main action method: install 08:36:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:36:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:36:24 INFO - Reading from file tmpfile_stdout 08:36:24 INFO - Detecting whether we're running mozinstall >=1.0... 08:36:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:36:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:36:25 INFO - Reading from file tmpfile_stdout 08:36:25 INFO - Output received: 08:36:25 INFO - Usage: mozinstall [options] installer 08:36:25 INFO - Options: 08:36:25 INFO - -h, --help show this help message and exit 08:36:25 INFO - -d DEST, --destination=DEST 08:36:25 INFO - Directory to install application into. [default: 08:36:25 INFO - "/builds/slave/test"] 08:36:25 INFO - --app=APP Application being installed. [default: firefox] 08:36:25 INFO - mkdir: /builds/slave/test/build/application 08:36:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 08:36:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 08:36:57 INFO - Reading from file tmpfile_stdout 08:36:57 INFO - Output received: 08:36:57 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 08:36:57 INFO - Running post-action listener: _resource_record_post_action 08:36:57 INFO - [mozharness: 2016-11-02 15:36:57.139825Z] Finished install step (success) 08:36:57 INFO - [mozharness: 2016-11-02 15:36:57.139964Z] Running run-tests step. 08:36:57 INFO - Running pre-action listener: _resource_record_pre_action 08:36:57 INFO - Running main action method: run_tests 08:36:57 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:36:57 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:36:57 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:36:57 INFO - 2016-11-02 08:36:57.154 screenresolution[1637:7515] starting screenresolution argv=screenresolution get 08:36:57 INFO - 2016-11-02 08:36:57.156 screenresolution[1637:7515] Display 0: 1600x1200x32@60 08:36:57 INFO - 2016-11-02 08:36:57.162 screenresolution[1638:7518] starting screenresolution argv=screenresolution list 08:36:57 INFO - Available Modes on Display 0 08:36:57 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:36:57 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:36:57 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:36:57 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:36:57 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:36:57 INFO - Intel Iris: 08:36:57 INFO - Chipset Model: Intel Iris 08:36:57 INFO - Type: GPU 08:36:57 INFO - Bus: Built-In 08:36:57 INFO - VRAM (Dynamic, Max): 1536 MB 08:36:57 INFO - Vendor: Intel (0x8086) 08:36:57 INFO - Device ID: 0x0a2e 08:36:57 INFO - Revision ID: 0x0009 08:36:57 INFO - Displays: 08:36:57 INFO - Display: 08:36:57 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:36:57 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:36:57 INFO - Display Serial Number: 1600x1200 60 08:36:57 INFO - Main Display: Yes 08:36:57 INFO - Mirror: Off 08:36:57 INFO - Online: Yes 08:36:57 INFO - Rotation: Supported 08:36:57 INFO - Return code: 0 08:36:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:36:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:36:57 INFO - Python 2.7.3 08:36:57 INFO - Return code: 0 08:36:57 INFO - grabbing minidump binary from tooltool 08:36:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:57 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1015e5d30>, '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 0x10144bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1015ddb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:36:57 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 08:36:57 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 08:36:57 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 08:36:57 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:36:57 INFO - Return code: 0 08:36:57 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 08:36:57 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:36:57 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:36:57 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 08:36:57 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:36:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0371', '--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 08:36:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0371 --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 08:36:57 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.SSsbR8AGKN/Render', 08:36:57 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:36:57 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:36:57 INFO - 'HOME': '/Users/cltbld', 08:36:57 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:36:57 INFO - 'LOGNAME': 'cltbld', 08:36:57 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:36:57 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 08:36:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:57 INFO - 'MOZ_NO_REMOTE': '1', 08:36:57 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:36:57 INFO - 'NO_EM_RESTART': '1', 08:36:57 INFO - 'PAGER': '/bin/cat', 08:36:57 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:36:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:57 INFO - 'PWD': '/builds/slave/test', 08:36:57 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:36:57 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:36:57 INFO - 'SHELL': '/bin/bash', 08:36:57 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.VAfti0hYAO/Listeners', 08:36:57 INFO - 'TMPDIR': '/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/', 08:36:57 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:36:57 INFO - 'USER': 'cltbld', 08:36:57 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:36:57 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:36:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:57 INFO - 'XPC_FLAGS': '0x0', 08:36:57 INFO - 'XPC_SERVICE_NAME': '0', 08:36:57 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:36:57 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0371', '--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 08:36:57 INFO - mozversion application_buildid: 20161102061118 08:36:57 INFO - mozversion application_changeset: 7959c8deda49fe57e5788a9b11febc5d7f896814 08:36:57 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:36:57 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:36:57 INFO - mozversion application_name: Firefox 08:36:57 INFO - mozversion application_remotingname: firefox-dev 08:36:57 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:36:57 INFO - mozversion application_vendor: Mozilla 08:36:57 INFO - mozversion application_version: 51.0a2 08:36:57 INFO - mozversion platform_buildid: 20161102061118 08:36:57 INFO - mozversion platform_changeset: 7959c8deda49fe57e5788a9b11febc5d7f896814 08:36:57 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:36:57 INFO - mozversion platform_version: 51.0a2 08:36:57 INFO - using testdate: 1478101017 08:36:57 INFO - actual date: 1478101017 08:36:57 INFO - starting webserver on 'localhost:49277' 08:36:57 INFO - SUITE-START | Running 2 tests 08:36:57 INFO - TEST-START | dromaeo_css 08:36:57 INFO - operating with platform_type : mac_ 08:36:57 INFO - Initialising browser for dromaeo_css test... 08:36:57 INFO - TEST-INFO | started process 1648 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/tmpdEi9Ur/profile http://localhost:49277/getInfo.html) 08:37:00 INFO - PROCESS | 1648 | __metrics Screen width/height:1600/1200 08:37:00 INFO - PROCESS | 1648 | colorDepth:24 08:37:00 INFO - PROCESS | 1648 | Browser inner width/height: 1024/689 08:37:00 INFO - PROCESS | 1648 | __metrics 08:37:00 ERROR - PROCESS | 1648 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 08:37:01 INFO - TEST-INFO | 1648: exit 0 08:37:01 INFO - Browser initialized. 08:37:01 INFO - Running cycle 1/1 for dromaeo_css test... 08:37:01 INFO - TEST-INFO | started process 1651 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/tmpdEi9Ur/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:37:13 INFO - PROCESS | 1651 | RSS: Main: 225652736 08:37:13 INFO - PROCESS | 1651 | 08:38:02 INFO - PROCESS | 1651 | 1478101082958 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 08:40:14 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49277/tests/dromaeo/cssquery-ext.html) 08:40:16 INFO - PROCESS | 1651 | RSS: Main: 239005696 08:40:16 INFO - PROCESS | 1651 | 08:43:18 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-ext.html (next: http://localhost:49277/tests/dromaeo/cssquery-jquery.html) 08:43:18 INFO - PROCESS | 1651 | RSS: Main: 248901632 08:43:18 INFO - PROCESS | 1651 | 08:46:20 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49277/tests/dromaeo/cssquery-mootools.html) 08:46:21 INFO - PROCESS | 1651 | RSS: Main: 252219392 08:46:21 INFO - PROCESS | 1651 | 08:49:23 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49277/tests/dromaeo/cssquery-prototype.html) 08:49:23 INFO - PROCESS | 1651 | RSS: Main: 252588032 08:49:23 INFO - PROCESS | 1651 | 08:52:26 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49277/tests/dromaeo/cssquery-yui.html) 08:52:27 INFO - PROCESS | 1651 | RSS: Main: 257146880 08:52:27 INFO - PROCESS | 1651 | 08:55:29 INFO - PROCESS | 1651 | Cycle 1(1): loaded http://localhost:49277/tests/dromaeo/cssquery-yui.html (next: http://localhost:49277/tests/dromaeo/cssquery-dojo.html) 08:55:29 INFO - PROCESS | 1651 | RSS: Main: 258392064 08:55:29 INFO - PROCESS | 1651 | 08:55:29 INFO - PROCESS | 1651 | __start_tp_report 08:55:29 INFO - PROCESS | 1651 | _x_x_mozilla_page_load 08:55:29 INFO - PROCESS | 1651 | _x_x_mozilla_page_load_details 08:55:29 INFO - PROCESS | 1651 | |i|pagename|runs| 08:55:29 INFO - PROCESS | 1651 | |0;dojo.html;3330.3838789823867;3377.24012097278;3385.3060122674847;3387.745919056071;3393.5079413485046;5661.716914154286;5669.574781891354;5689.175069614908;5697.316322041351;5783.103618939061;5701.486866182043;5764.538836893049;5782.508486778618;5793.565482588801;5813.30240371156;5248.5538729208065;5252.52727254547;5258.815941442051;5300.867478313035;5308.416074231832;4687.203175460163;5014.749262536877;5234.162533994542;5317.335333083364;5320.9467905321035;5108.514691104339;5190.792368305263;5216.295800067;5243.528082472596;5260.815871444481;5163.0190263849745;5165;5188.818391356284;5271;5299.443558426348;5202.76587553561;5203.895922081537;5216.139337009389;5246.737663116829;5258.6318957672975;4861.611071114302;5566.332040155166;5755.079187330007;5759.827205183809;5771.711414429262;6158.476529494954;6166.1983942087245;6179.876402471926;6258.874822503524;6320.178376811031;6327.303996560375;6330.493560515148;6331.715072821688;6348.365163483661;6377.48980081597;5842.883142337129;5853.356130825606;5879.559033072536;5890.322612899486;5893.616914900518;6168;6194.787544469714;6250.74997000124;6259.874802504016;6268.373162683695;5383.7846486140115;6199.535034872402;6207.037909124093;6231.127642130105;6231.2522497300615;4858.246971719318;6344.492440604833;6345.428911397997;6356.618602883842;6371.617702937746;5977.462028417463;6127.433875357673;6136.539759518054;6207.6585787782105;6228.719707613078;5679.807240479546;5850.297964244318;6284.842878927972;6300.117983482316;6314.589551679126;4939.604831613462;4941.085899108676;4954.826581069645;4955.4796746341835;5009.89980200394;4359.476862776487;4370.890727731832;4384.210842048398;4437.156940181355;4454.955450445519;5781.942180578225;5917.615355001911;5925.614835035709;5955.970220148958;6025.548083893726;6184.938150618526;6185.690715464209;6192.102145188923;6211.627302361872;6230;4884.535969082932;5572.4706152915405;5786.42135786418;5848.210491583582;5896.852578685567;5451.672899625956;5452.154915987949;5465.699386533699;5476.726163691799;5510.201020851954;5001.649884508195;5710.65736055838;6112.808002439481;6312.747490100436;6322.968385158045;6162.661053642093;6177.135201071944;6264.843378915563;6321.33625969285;6322.430981211713;6248.968755156195;6306.211723534559;6307.747690092345;6322.46259067966;6341.460975816923;6200.503959683305;6201.782937597162;6209.96895015522;6218.129461875432;6227.719752611234;5882.5293976480925;5927.9703601481715;6333.683315834282;6338.809835704937;6339;6076.179715738319;6112.663803490851;6120.081455037822;6195.721192546256;6206.503479721521;6112.449879510687;6129.908051379144;6152.815415537541;6159.692015399301;6190.0405437157315;5801.883962320646;5818.709064546841;5967.791127310524;6042.75828966854;6051.273847138195;5993.4006599341465;6079.635221886701;6099.634021958696;6109.7861574844665;6166.445019948226;5987.670678112571;6022.66875321844;6029.849253768691;6030.939690603213;6071.301800293023 08:55:29 INFO - PROCESS | 1651 | |1;ext.html;482.12734949740974;493.95801356884664;520.2898044169709;524.0357741755171;533.5038414274726;38820.029499262535;40382.19235615286;40630.390544141825;42259.36610950838;42342;41388.37917431241;41544.79227603865;41957;42014;42170.57829421705;9758;9876;9911.752206194831;9924.057214564606;9932.801343973117;9804.558794854212;9898.703038908845;9903.752406189831;9922.007799220057;9947.502624868765;9921.801563968716;9926.45404502752;9930.553125109387;9970.25223108266;9992.300538962276;9862.753431164207;9923.801523969516;9938.801223975552;9942;9955;9805.215582753362;9867.013298670146;9873.210143188528;9882.456464894429;9906.504674766305;39575.80212098921;39783.40324895129;39825.60174398277;39859.80070099631;39895.8005209975;3015.381846721417;3331.4836200388736;3484.8083355415442;3755.248950209969;3779.5842457329672;29295.414091718045;30041.699583004327;30119.849400752857;30522.694773052208;30586.69413305861;3159.0996565978817;3204.150900011499;3208.230024794056;3236.7410607151373;3250.577424934767;508835;510851;513898;516806;517362;32064.038078857673;45857.77071114623;60678.696606516685;60822.69588652117;60971.390286097456;32014;32938.67061329404;34049.48925766115;34365.48451773226;34507.82746086304;14603.269836508132;14738.705225895423;14755.55733328002;14760.63098422548;14790.260486975609;9608.471534065693;11195.992360687576;12324.568640097732;12487.313197774029;12616.810747838606;6498.700259948029;7587.468877178655;7680.270374314431;7718;7725.8454830903065;2731.3444773254673;3181.347823696137;3235.789673671251;3240.465323221642;3259.4947783093658;739.3161325773638;966.5602151021268;967.032967032967;1027.2603725317758;1068.7221322456217;29331.560026599618;29750;29974.95087671921;30472.933447329237;30744;875.4834647557972;957.9760505987267;966.3139171188535;1064.984025239622;1097.7759797825527;11524.827127593093;13129.67175820593;13597.32013399326;16526.421575244807;16628.83371166297;336418;357586;361887;362234;677339;56055.439445605836;56394.43605563974;56433;56581.868362632515;56690.43309566934;1353.262471952788;1354.1807206639842;1380.2132784312846;1380.7376598446465;1383.75784237758;24153.758462415855;29894.551581725857;31113.755449781755;31724.524132138496;32531.51202732008;53779.731101344245;53886.730566346916;54527;54531.454685452634;54634.907301852945;637421.8128909512;642832;643176;644783;648408;41418.96452588589;41730.58269417267;42228.36657450079;42307.576924231595;42561.78719106385;45888;45888.08223835572;45909.08181836412;46133.07733845372;46796.7660161697;37609;37651.87044388673;39324;39403;39556.60443395645;28967.855160724903;35117.82441087778;36652.63347366492;38065.4290185653;40166.598334016286;33795.3240935175;36963.26073478461;37622.8118859404;38338.6166138335;38381.424278635284;32960.340793184485;34046.148846279044;34696.653033469345;34800.65199348075;35038;23378.883105584362;23801.285961421185;25939.351516212246;26046.08838690637;26052.869735651202 08:55:29 INFO - PROCESS | 1651 | |2;jquery.html;379.1298968866451;382.32901258291713;386.41377146812334;390.77335145615547;406.16735691831735;18958.90520547397;21025.894870525663;21450.89274553629;21564.382671299656;21801.454963625936;20063.498412539695;20246.39260822174;20446.591068178626;20678.586428271425;20744.48138796531;5888.7055647217685;5941.732622032008;6038.788642397517;6114.541409394291;6126.356732543086;4161.771102589357;4383.6273916716955;6036.5170786336985;6088.178095957055;6412;6625.768098116567;6764.864702705943;6765.898511522331;6778.525503214777;6797.7960661179995;6492.805215843508;6706.295838936914;6755.797326080176;6773.559718618274;6774.254831968479;5263.973525162595;5388.407275199725;5801.100829371454;5838.095095260199;5844.590878638497;21870.01584928666;21995.120195192332;22738.545229095325;25682.357941051436;26036.73963260381;2374.0978428197345;2412.6381042843536;2513.5978243480954;2712.308361367858;2883.351245969661;13605.863941360558;14250.144991300554;15270.31283592241;15490.767638485431;15699.450519231887;1843.4469659102215;1910.7133929910485;1913.0243575776315;1913.3303343829548;1938.3990962801436;111776.44111779389;112256;123481;124651;125903;7865.370770338359;9542.141207291377;10946.945265273622;11024;11156.665300041012;13521.526746563823;13539.661508462368;13543.45826166962;13548.525801596898;13565.525206617722;8520.914790852135;8773.210411063035;8828.646854125891;8897.866532002025;8906.821863562822;7973.9202607973175;8805.59110542323;8863.379563430499;8972.820543589221;9063.456192628464;5804.82585522435;6378.872422551616;6555.934440655627;6631;6696.665166741644;1435.7343891380128;1576.2276484522731;1640.7292796688412;1831.624516974017;1865.6548538520146;889.3285569395065;900.9954950225207;941.0683423410774;999.1357475783541;1003.2174903575223;17305.30778768835;18988.43034708961;20729;20904.059317330757;21300.25449109274;941.684535680541;945.8082815652327;977.2328721953374;981.8674478945394;1014.0366651680932;10846.023857852831;11185.937335953071;11264.267822591506;11276.718082048015;11362.94318528402;498455;510853;572286.1385693045;619109;646504.7674761596;128191;133519;134162;135508.6449135496;136578.6342136566;964.4454438697777;968.2447690801187;1013.5084484025242;1014.0214692821463;1017.1506791828906;15225.543233703007;15734.449294274646;16288.837111628733;18000.90999544994;19438.51403714862;58781;59004.81990360083;59576.70211648914;59697;60313;83849;87173.38479845614;90002.54998724964;90511;92822.53588732013;6394.328595497405;7794.22057794216;7995.400344974034;8205.630746616298;8215.630296636546;11898.643040708792;12415.93792031034;12599.496020159091;12714.364281785689;12945.093843431247;9326.860097098413;10080.848787268344;10805.459727013775;11125.666230013112;11236.325820450798;10993.560257589606;11096.44517774092;11103.111751060058;11344.319340839576;11351.772964540498;5866.2373891393845;8448.95775521143;10063.849042264519;11229.831552526883;11703.356315402734;7882.211778822072;8036.557989310644;8378.790530236549;8386.119457457124;8389.161083891562;8546.914530854612;10737.463126843782;11253.493592788507;11330.206885517935;11541 08:55:29 INFO - PROCESS | 1651 | |3;mootools.html;1402.6002589262062;1487.6206567325335;1655.776470176526;1820.5539642787503;1841.8066103059186;7959.840803183933;8229;8497.91502084979;8979.865302020475;9001.279897608192;8452.07027227006;8769.7807554811;8797.648094076229;8875.73372798817;8883.64465421384;2367.396313939943;2385.4990452005013;2396.005657652081;2396.616541353375;2407.0010945457616;2359.9882000589973;2394.1859767678984;2399.880005999693;2406.8074554035634;2407.518496300738;2369.3721163891582;2382.618780995041;2393.078664714089;2403.038784486202;2408.2414039577475;2349.4126468382906;2355.0579768092816;2368.609179485383;2369.277370402027;2370.1230544698487;2329.7320808106947;2339.754325795801;2342.355852140658;2347.8943447544902;2361.3388251289666;8826.382153249275;8888.688895888678;8918.375713700043;8955.059718729504;8996.730098097067;5249.790008399659;5426.5116139547235;5429.809956651498;5438.619296649236;5440.564754819605;3599.5680518337704;3614.2771445710964;3633.073566240592;3635.4910312556262;3689.0039689283744;1090.138790355618;1095.4413249242864;1101.3336931156696;1101.438266484091;1104.1222228328497;11487.25332853362;11514.884851151464;11628.76742465146;11672;11698.707532311675;4599.402077729874;4660.13787449323;4829.444613869379;4834.5890599299455;4853.39332583427;9986.750331241778;10108;10126.746831329276;10131.64539241123;10145.985401459942;4516.1419330327135;5382.91925621116;5407.188921661782;5410.161424979135;5424.674519528841;3730.8880733578035;4158.875233742992;4545.977270113628;4788.401449818773;4908.950910490921;3925.842966281317;3959.9010024749036;4005.239004589119;4040.4141399496907;4077.531083925327;1101.5593762494907;1294.1264646363668;1308.9593772950527;1311.888489478405;1315.7697402954445;754.5698951597647;840.7015509494164;897.3494216692976;903.7830920579145;907.4147175072042;4826.227803551415;4860.343853579721;5656.971715141398;5751.281089863767;5826.941730582725;936.5457752989795;952.5189779161618;984.699666601679;998.8002399520125;1007.5314978534869;3735.5704094029534;3959.524857017119;4017.0359113812474;4021.4369988201674;4035.1324465240114;10448.902865199198;10848;10872.782544349227;10876.184286178568;10900.563977440814;10088.293819432569;10636.574537018432;10715.19636027301;10861.402622855661;10951.397673128055;8059.959700201579;8252.587370631445;8254.54599996994;8285.005799304123;8293.543855088028;5907.852303692442;5932.406759324205;5989.910151347821;6018.21763170785;6174.44430001302;9837.754056148653;10005.349652272578;10037.397756134364;10166.796664066826;10246.590136394461;10148.847767283349;10190.541425636013;10270.33242839213;10393.896061039293;10418.479076046318;6998.790036298919;7193.280671932765;7535.58554279498;7555.320021198118;7694.769156925301;8319.708810191614;8416.410851240355;8428.4942903426;8449.197326253996;8458.154184581492;7358.080239970004;7421.740239091606;7534.698612055676;7620.8475830484185;7696.230376962483;7216.206217315986;7394.371478424394;7416.369608583331;7424.220456851953;7540.17058123595;5859.296884373903;6956.930430695831;7039.1553013638695;7045.26024767392;7048.154221493453;4972.756810797301;5002.299678045149;5004.899902001866;5088.440271570198;5113.463086375877;5019;5103.004914041875;5108.948910510996;5111.156659151198;5195.168772996302 08:55:30 INFO - PROCESS | 1651 | |4;prototype.html;299.15637901118845;304.23788410032876;312.7373006674394;316.9540416639586;317.31776680137716;4914.640972333282;4952.479989601085;5481.369642491115;5572.183054607596;5649.6892670903135;4567.246404343279;4908.312836202926;5233.79064837407;5325.840224793253;5401.4868587484125;3260.347930413915;3730.160713839378;4124.752514849104;4162.438070860433;4202.936955945664;3488.9009961862057;4180.7909604519655;4208.622128497389;4224.894377640553;4252.893677658052;3193.8722451101926;3386.5766779152605;4128.62842344189;4149.273877071516;4191.685623578229;3402;4139.565345638694;4151.60559746825;4170.749755014709;4197.244495990721;3644.817759112034;3652.1234903623204;3654.7807131571926;3660.3411385950785;3662.3224703429682;5127.743702792803;5247.658902171384;5376.946230537684;5402.756875940592;5427.45725427458;3954.367301231789;4711.811527538928;4746.5285761413725;4774.856754297377;4782.7130372177435;4649.790759415834;5583.4137415571595;5800.24596802413;5829.358770535237;5866.472017518401;3616.276744651054;3903.3800972596337;3910.374340105598;3920.411938209263;4022.5374081980362;4957.975210123926;5069.847904562869;5589.909967556328;5844;6136.760082569875;3470.288590838872;3978;3980.840766369313;3982.561918188997;3987.940180897289;3638.199596088856;3874.9806250969127;4015.6988225883174;4020.718549701493;4049.311617025113;4056.566060363758;4268.573142685706;4272.380504826782;4656.95343046572;4680.578747912636;5211.045857803324;5712.0860662293835;5836.533077353802;5842.357340692521;5871.500922421556;1090.8690957085041;1129.627223016419;1244.4710997825887;1254.7553227120807;1335.937929346172;762.5843915066191;822.6298165825402;908.7909780750332;909.6361455417886;920.8848893888264;5401.891962160735;5441.183822426588;5453.754581043862;5482.806877249052;5482.8081017165005;5797.24635797352;5843.444872737083;5883.970580147072;5970.85072873173;5993.790217342372;5375.16684913839;5392.460753924576;5416.377116631637;5438.809641662523;5457.754401051962;2289.5993201189726;2356.32844639277;2531.0508559290265;2619.751123643251;2653.6152257922495;4172.248995180897;4329;4341.5007274163245;4765.642576806753;4890.535399137077;4065.3495440729935;4561.908761824811;4905.258633185239;4961.984394643885;4972.477889821589;4798.688085274516;5047.54243343311;5099.082165210298;5099.847004589868;5100.591952643854;4686.437627484724;4811.639127065414;4927.940492794067;5018.29743835856;5086.821961231339;4127.111022284473;4327.826886924488;4724.598409135262;4834.419869615669;5042.445331013659;4279.117188437078;5099.5410413063;5140.871478213075;5159.690418574897;5196.947205853742;3201.855916483717;3435.519027336125;3440.36353274645;3828.406596977473;3973.841046358113;5244.76398562058;5300.893982120413;5910.763569457174;5954.76180952757;6005.819825405245;5674.432556744293;5715;5789.797357092481;5795.740131003625;5816.912746308724;5419.482544887438;5580.972095139661;5692.658440493584;5757.560609847538;5765.760361522292;4543.931841022321;4974.253861920741;5229.980153870111;5552.278203833475;5576.358718747396;4864.148773964613;5744.3394009687745;5744.511716504144;5775.768969241351;5808.82573522795;5362.257266388361;5546.417626149197;5625.690587017753;5643.081352340224;5700.315962084576 08:55:30 INFO - PROCESS | 1651 | |5;yui.html;682.2972338491355;699.8040548646379;710.7405796884138;728.1917072050023;738.6085374751382;15152.242387880604;15590.06459612424;15679.843201567981;15813.209339533036;15867.84132158678;13656.38546265418;13945.790813137812;14058.226797526131;14212.71574568508;14217.786733198984;844.4342290665269;867.995660021699;869.9347548933823;872.8821609082788;873.3144481581959;687.3092541995313;711;837.2966707965307;869.8086420987372;873.2751815992742;893.4460634406677;920.392540922991;922.128588483883;924.0066928052337;927.6753136402273;904.9954750226207;911.6262332443666;912.7854954085784;913.5249670171506;920.2775820980531;616.737886398279;677.2753154125088;677.3971165662564;680.5610381304031;681.6046692918096;11983.820242696367;14851.331690073972;14854.628634284229;14894.553163405115;14924.70150596982;12641.367931603383;13937.651558711012;14719.116852988855;14859.331330090172;14883.851161488463;11610.76778464426;11653.883461165364;11778.823317650242;11807.409629518575;12222.877771222351;3372.4266874631126;3445.2592692571216;3688.483612294281;3753.6246375362243;3948.6446219840063;82571.5871420639;101888.47167292496;109189.45405273003;109695;110990.33514497208;10854.403007834644;10936.687597488351;11020.283681560673;11045.28205666629;11055.557777688802;20738;20834;20839.687404688942;20873.26943556968;20896.895515522327;7607.35337496308;7640.312371886557;7864.898914152023;7914.089879663798;7966;4339.631131353807;4472.888177795516;4604.37840891482;4638.884027899262;4705.435347758223;3571.8571257149424;3709.5548534176073;3722.3671975764187;3723.162288485069;3723.1995121048562;653.6274323635578;655.3315618069543;686.4268335939447;708.7909066825299;720.3192982631363;575.9164921086502;646.208394716478;689.3141324382271;689.396777819408;707.7628994286869;9743.943537539853;9834.213262938947;9836.747426432466;9861.112499875046;9886.653967111117;580.4427749360576;649.7368565730886;669.5580916595023;696.3002182806247;709.9503034787515;4577.450705915245;4693.7653117344;4709.905801884011;4711.246200607886;4760.976195119071;163586;167154.32845671632;168637;171784;175517;137561;137771.6222837779;142153;142860;143103.56896430903;67300.66349668318;92890;95672.56491152638;100372;124578;7841.372690184886;9909.900900991186;9936.602535898483;10113.59545618167;10239.129673977795;58792;60576.27406766618;62326.68836655788;63849;64490.35509644844;47813;63704.36295636984;66922.33077669161;76471;90746.54626726825;12266.386680665753;12616.369181540702;13320.467181312639;13323.933380333036;13766.793498097337;13795.310234488035;13795.448182073007;14444.638884027983;14915.776263356276;14974.326155323255;13543.305513517944;13644.181349119084;14170.220637865017;14271.14373137615;14306.284685765879;12740.87259127434;13696.93151534236;14225.217613031382;14282.642933926734;14835.10989340643;13458.461661533429;13640.590782276548;13677.384517696528;13731.45074197021;13893.791593126314;11224.94387528057;11274.60538881168;11837;12101;12108.878911210775;10209.183265338903;11330.773384532427;11644.6506604802;11756.647300580997;11911.52353905834 08:55:30 INFO - PROCESS | 1651 | __end_tp_report 08:55:30 INFO - PROCESS | 1651 | __start_cc_report 08:55:30 INFO - PROCESS | 1651 | _x_x_mozilla_cycle_collect,366 08:55:30 INFO - PROCESS | 1651 | __end_cc_report 08:55:30 INFO - PROCESS | 1651 | __startTimestamp1478102129987__endTimestamp 08:55:30 INFO - PROCESS | 1651 | 08:55:30 INFO - PROCESS | 1651 | ------- Summary: start ------- 08:55:30 INFO - PROCESS | 1651 | Number of tests: 6 08:55:30 INFO - PROCESS | 1651 | 08:55:30 INFO - PROCESS | 1651 | [#0] dojo.html Cycles:165 Average:5731.34 Median:5927.97 stddev:651.28 (11.0%) stddev-sans-first:625.45 08:55:30 INFO - PROCESS | 1651 | Values: 3330.4 3377.2 3385.3 3387.7 3393.5 5661.7 5669.6 5689.2 5697.3 5783.1 5701.5 5764.5 5782.5 5793.6 5813.3 5248.6 5252.5 5258.8 5300.9 5308.4 4687.2 5014.7 5234.2 5317.3 5320.9 5108.5 5190.8 5216.3 5243.5 5260.8 5163.0 5165.0 5188.8 5271.0 5299.4 5202.8 5203.9 5216.1 5246.7 5258.6 4861.6 5566.3 5755.1 5759.8 5771.7 6158.5 6166.2 6179.9 6258.9 6320.2 6327.3 6330.5 6331.7 6348.4 6377.5 5842.9 5853.4 5879.6 5890.3 5893.6 6168.0 6194.8 6250.7 6259.9 6268.4 5383.8 6199.5 6207.0 6231.1 6231.3 4858.2 6344.5 6345.4 6356.6 6371.6 5977.5 6127.4 6136.5 6207.7 6228.7 5679.8 5850.3 6284.8 6300.1 6314.6 4939.6 4941.1 4954.8 4955.5 5009.9 4359.5 4370.9 4384.2 4437.2 4455.0 5781.9 5917.6 5925.6 5956.0 6025.5 6184.9 6185.7 6192.1 6211.6 6230.0 4884.5 5572.5 5786.4 5848.2 5896.9 5451.7 5452.2 5465.7 5476.7 5510.2 5001.6 5710.7 6112.8 6312.7 6323.0 6162.7 6177.1 6264.8 6321.3 6322.4 6249.0 6306.2 6307.7 6322.5 6341.5 6200.5 6201.8 6210.0 6218.1 6227.7 5882.5 5928.0 6333.7 6338.8 6339.0 6076.2 6112.7 6120.1 6195.7 6206.5 6112.4 6129.9 6152.8 6159.7 6190.0 5801.9 5818.7 5967.8 6042.8 6051.3 5993.4 6079.6 6099.6 6109.8 6166.4 5987.7 6022.7 6029.8 6030.9 6071.3 08:55:30 INFO - PROCESS | 1651 | 08:55:30 INFO - PROCESS | 1651 | [#1] ext.html Cycles:180 Average:65421.42 Median:39842.70 stddev:144235.89 (362.0%) stddev-sans-first:144558.10 08:55:30 INFO - PROCESS | 1651 | Values: 482.1 494.0 520.3 524.0 533.5 38820.0 40382.2 40630.4 42259.4 42342.0 41388.4 41544.8 41957.0 42014.0 42170.6 9758.0 9876.0 9911.8 9924.1 9932.8 9804.6 9898.7 9903.8 9922.0 9947.5 9921.8 9926.5 9930.6 9970.3 9992.3 9862.8 9923.8 9938.8 9942.0 9955.0 9805.2 9867.0 9873.2 9882.5 9906.5 39575.8 39783.4 39825.6 39859.8 39895.8 3015.4 3331.5 3484.8 3755.2 3779.6 29295.4 30041.7 30119.8 30522.7 30586.7 3159.1 3204.2 3208.2 3236.7 3250.6 508835.0 510851.0 513898.0 516806.0 517362.0 32064.0 45857.8 60678.7 60822.7 60971.4 32014.0 32938.7 34049.5 34365.5 34507.8 14603.3 14738.7 14755.6 14760.6 14790.3 9608.5 11196.0 12324.6 12487.3 12616.8 6498.7 7587.5 7680.3 7718.0 7725.8 2731.3 3181.3 3235.8 3240.5 3259.5 739.3 966.6 967.0 1027.3 1068.7 29331.6 29750.0 29975.0 30472.9 30744.0 875.5 958.0 966.3 1065.0 1097.8 11524.8 13129.7 13597.3 16526.4 16628.8 336418.0 357586.0 361887.0 362234.0 677339.0 56055.4 56394.4 56433.0 56581.9 56690.4 1353.3 1354.2 1380.2 1380.7 1383.8 24153.8 29894.6 31113.8 31724.5 32531.5 53779.7 53886.7 54527.0 54531.5 54634.9 637421.8 642832.0 643176.0 644783.0 648408.0 41419.0 41730.6 42228.4 42307.6 42561.8 45888.0 45888.1 45909.1 46133.1 46796.8 37609.0 37651.9 39324.0 39403.0 39556.6 28967.9 35117.8 36652.6 38065.4 40166.6 33795.3 36963.3 37622.8 38338.6 38381.4 32960.3 34046.1 34696.7 34800.7 35038.0 23378.9 23801.3 25939.4 26046.1 26052.9 08:55:30 INFO - PROCESS | 1651 | 08:55:30 INFO - PROCESS | 1651 | [#2] jquery.html Cycles:180 Average:34909.15 Median:25859.55 stddev:96196.74 (372.0%) stddev-sans-first:96431.66 08:55:30 INFO - PROCESS | 1651 | Values: 379.1 382.3 386.4 390.8 406.2 18958.9 21025.9 21450.9 21564.4 21801.5 20063.5 20246.4 20446.6 20678.6 20744.5 5888.7 5941.7 6038.8 6114.5 6126.4 4161.8 4383.6 6036.5 6088.2 6412.0 6625.8 6764.9 6765.9 6778.5 6797.8 6492.8 6706.3 6755.8 6773.6 6774.3 5264.0 5388.4 5801.1 5838.1 5844.6 21870.0 21995.1 22738.5 25682.4 26036.7 2374.1 2412.6 2513.6 2712.3 2883.4 13605.9 14250.1 15270.3 15490.8 15699.5 1843.4 1910.7 1913.0 1913.3 1938.4 111776.4 112256.0 123481.0 124651.0 125903.0 7865.4 9542.1 10946.9 11024.0 11156.7 13521.5 13539.7 13543.5 13548.5 13565.5 8520.9 8773.2 8828.6 8897.9 8906.8 7973.9 8805.6 8863.4 8972.8 9063.5 5804.8 6378.9 6555.9 6631.0 6696.7 1435.7 1576.2 1640.7 1831.6 1865.7 889.3 901.0 941.1 999.1 1003.2 17305.3 18988.4 20729.0 20904.1 21300.3 941.7 945.8 977.2 981.9 1014.0 10846.0 11185.9 11264.3 11276.7 11362.9 498455.0 510853.0 572286.1 619109.0 646504.8 128191.0 133519.0 134162.0 135508.6 136578.6 964.4 968.2 1013.5 1014.0 1017.2 15225.5 15734.4 16288.8 18000.9 19438.5 58781.0 59004.8 59576.7 59697.0 60313.0 83849.0 87173.4 90002.5 90511.0 92822.5 6394.3 7794.2 7995.4 8205.6 8215.6 11898.6 12415.9 12599.5 12714.4 12945.1 9326.9 10080.8 10805.5 11125.7 11236.3 10993.6 11096.4 11103.1 11344.3 11351.8 5866.2 8449.0 10063.8 11229.8 11703.4 7882.2 8036.6 8378.8 8386.1 8389.2 8546.9 10737.5 11253.5 11330.2 11541.0 08:55:30 INFO - PROCESS | 1651 | 08:55:30 INFO - PROCESS | 1651 | [#3] mootools.html Cycles:180 Average:5724.96 Median:4807.31 stddev:3214.40 (66.9%) stddev-sans-first:3207.00 08:55:30 INFO - PROCESS | 1651 | Values: 1402.6 1487.6 1655.8 1820.6 1841.8 7959.8 8229.0 8497.9 8979.9 9001.3 8452.1 8769.8 8797.6 8875.7 8883.6 2367.4 2385.5 2396.0 2396.6 2407.0 2360.0 2394.2 2399.9 2406.8 2407.5 2369.4 2382.6 2393.1 2403.0 2408.2 2349.4 2355.1 2368.6 2369.3 2370.1 2329.7 2339.8 2342.4 2347.9 2361.3 8826.4 8888.7 8918.4 8955.1 8996.7 5249.8 5426.5 5429.8 5438.6 5440.6 3599.6 3614.3 3633.1 3635.5 3689.0 1090.1 1095.4 1101.3 1101.4 1104.1 11487.3 11514.9 11628.8 11672.0 11698.7 4599.4 4660.1 4829.4 4834.6 4853.4 9986.8 10108.0 10126.7 10131.6 10146.0 4516.1 5382.9 5407.2 5410.2 5424.7 3730.9 4158.9 4546.0 4788.4 4909.0 3925.8 3959.9 4005.2 4040.4 4077.5 1101.6 1294.1 1309.0 1311.9 1315.8 754.6 840.7 897.3 903.8 907.4 4826.2 4860.3 5657.0 5751.3 5826.9 936.5 952.5 984.7 998.8 1007.5 3735.6 3959.5 4017.0 4021.4 4035.1 10448.9 10848.0 10872.8 10876.2 10900.6 10088.3 10636.6 10715.2 10861.4 10951.4 8060.0 8252.6 8254.5 8285.0 8293.5 5907.9 5932.4 5989.9 6018.2 6174.4 9837.8 10005.3 10037.4 10166.8 10246.6 10148.8 10190.5 10270.3 10393.9 10418.5 6998.8 7193.3 7535.6 7555.3 7694.8 8319.7 8416.4 8428.5 8449.2 8458.2 7358.1 7421.7 7534.7 7620.8 7696.2 7216.2 7394.4 7416.4 7424.2 7540.2 5859.3 6956.9 7039.2 7045.3 7048.2 4972.8 5002.3 5004.9 5088.4 5113.5 5019.0 5103.0 5108.9 5111.2 5195.2 08:55:30 INFO - PROCESS | 1651 | 08:55:30 INFO - PROCESS | 1651 | [#4] prototype.html Cycles:180 Average:4442.65 Median:4911.48 stddev:1384.78 (28.2%) stddev-sans-first:1353.29 08:55:30 INFO - PROCESS | 1651 | Values: 299.2 304.2 312.7 317.0 317.3 4914.6 4952.5 5481.4 5572.2 5649.7 4567.2 4908.3 5233.8 5325.8 5401.5 3260.3 3730.2 4124.8 4162.4 4202.9 3488.9 4180.8 4208.6 4224.9 4252.9 3193.9 3386.6 4128.6 4149.3 4191.7 3402.0 4139.6 4151.6 4170.7 4197.2 3644.8 3652.1 3654.8 3660.3 3662.3 5127.7 5247.7 5376.9 5402.8 5427.5 3954.4 4711.8 4746.5 4774.9 4782.7 4649.8 5583.4 5800.2 5829.4 5866.5 3616.3 3903.4 3910.4 3920.4 4022.5 4958.0 5069.8 5589.9 5844.0 6136.8 3470.3 3978.0 3980.8 3982.6 3987.9 3638.2 3875.0 4015.7 4020.7 4049.3 4056.6 4268.6 4272.4 4657.0 4680.6 5211.0 5712.1 5836.5 5842.4 5871.5 1090.9 1129.6 1244.5 1254.8 1335.9 762.6 822.6 908.8 909.6 920.9 5401.9 5441.2 5453.8 5482.8 5482.8 5797.2 5843.4 5884.0 5970.9 5993.8 5375.2 5392.5 5416.4 5438.8 5457.8 2289.6 2356.3 2531.1 2619.8 2653.6 4172.2 4329.0 4341.5 4765.6 4890.5 4065.3 4561.9 4905.3 4962.0 4972.5 4798.7 5047.5 5099.1 5099.8 5100.6 4686.4 4811.6 4927.9 5018.3 5086.8 4127.1 4327.8 4724.6 4834.4 5042.4 4279.1 5099.5 5140.9 5159.7 5196.9 3201.9 3435.5 3440.4 3828.4 3973.8 5244.8 5300.9 5910.8 5954.8 6005.8 5674.4 5715.0 5789.8 5795.7 5816.9 5419.5 5581.0 5692.7 5757.6 5765.8 4543.9 4974.3 5230.0 5552.3 5576.4 4864.1 5744.3 5744.5 5775.8 5808.8 5362.3 5546.4 5625.7 5643.1 5700.3 08:55:30 INFO - PROCESS | 1651 | 08:55:30 INFO - PROCESS | 1651 | [#5] yui.html Cycles:180 Average:24578.20 Median:3630.17 stddev:40576.24 (1117.8%) stddev-sans-first:40650.40 08:55:30 INFO - PROCESS | 1651 | Values: 682.3 699.8 710.7 728.2 738.6 15152.2 15590.1 15679.8 15813.2 15867.8 13656.4 13945.8 14058.2 14212.7 14217.8 844.4 868.0 869.9 872.9 873.3 687.3 711.0 837.3 869.8 873.3 893.4 920.4 922.1 924.0 927.7 905.0 911.6 912.8 913.5 920.3 616.7 677.3 677.4 680.6 681.6 11983.8 14851.3 14854.6 14894.6 14924.7 12641.4 13937.7 14719.1 14859.3 14883.9 11610.8 11653.9 11778.8 11807.4 12222.9 3372.4 3445.3 3688.5 3753.6 3948.6 82571.6 101888.5 109189.5 109695.0 110990.3 10854.4 10936.7 11020.3 11045.3 11055.6 20738.0 20834.0 20839.7 20873.3 20896.9 7607.4 7640.3 7864.9 7914.1 7966.0 4339.6 4472.9 4604.4 4638.9 4705.4 3571.9 3709.6 3722.4 3723.2 3723.2 653.6 655.3 686.4 708.8 720.3 575.9 646.2 689.3 689.4 707.8 9743.9 9834.2 9836.7 9861.1 9886.7 580.4 649.7 669.6 696.3 710.0 4577.5 4693.8 4709.9 4711.2 4761.0 163586.0 167154.3 168637.0 171784.0 175517.0 137561.0 137771.6 142153.0 142860.0 143103.6 67300.7 92890.0 95672.6 100372.0 124578.0 7841.4 9909.9 9936.6 10113.6 10239.1 58792.0 60576.3 62326.7 63849.0 64490.4 47813.0 63704.4 66922.3 76471.0 90746.5 12266.4 12616.4 13320.5 13323.9 13766.8 13795.3 13795.4 14444.6 14915.8 14974.3 13543.3 13644.2 14170.2 14271.1 14306.3 12740.9 13696.9 14225.2 14282.6 14835.1 13458.5 13640.6 13677.4 13731.5 13893.8 11224.9 11274.6 11837.0 12101.0 12108.9 10209.2 11330.8 11644.7 11756.6 11911.5 08:55:30 INFO - PROCESS | 1651 | -------- Summary: end -------- 08:55:30 INFO - PROCESS | 1651 | 08:55:30 INFO - TEST-INFO | 1651: exit 0 08:55:30 INFO - TEST-OK | dromaeo_css | took 1112840ms 08:55:30 INFO - TEST-START | kraken 08:55:30 INFO - operating with platform_type : mac_ 08:55:30 INFO - Initialising browser for kraken test... 08:55:30 INFO - TEST-INFO | started process 1663 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/tmpM5hSHU/profile http://localhost:49277/getInfo.html) 08:55:33 INFO - PROCESS | 1663 | __metrics Screen width/height:1600/1200 08:55:33 INFO - PROCESS | 1663 | colorDepth:24 08:55:33 INFO - PROCESS | 1663 | Browser inner width/height: 1024/689 08:55:33 INFO - PROCESS | 1663 | __metrics 08:55:33 ERROR - PROCESS | 1663 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 08:55:34 INFO - TEST-INFO | 1663: exit 0 08:55:34 INFO - Browser initialized. 08:55:34 INFO - Running cycle 1/1 for kraken test... 08:55:34 INFO - TEST-INFO | started process 1665 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/tmpM5hSHU/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:55:46 INFO - PROCESS | 1665 | RSS: Main: 225505280 08:55:46 INFO - PROCESS | 1665 | 08:55:48 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49277/tests/kraken/driver.html?testName=audio-beat-detection) 08:55:49 INFO - PROCESS | 1665 | RSS: Main: 237805568 08:55:49 INFO - PROCESS | 1665 | 08:55:52 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49277/tests/kraken/driver.html?testName=audio-dft) 08:55:52 INFO - PROCESS | 1665 | RSS: Main: 245374976 08:55:52 INFO - PROCESS | 1665 | 08:55:56 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49277/tests/kraken/driver.html?testName=audio-fft) 08:55:56 INFO - PROCESS | 1665 | RSS: Main: 249171968 08:55:56 INFO - PROCESS | 1665 | 08:55:58 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49277/tests/kraken/driver.html?testName=audio-oscillator) 08:55:59 INFO - PROCESS | 1665 | RSS: Main: 250740736 08:55:59 INFO - PROCESS | 1665 | 08:56:01 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49277/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:56:01 INFO - PROCESS | 1665 | RSS: Main: 250830848 08:56:01 INFO - PROCESS | 1665 | 08:56:04 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49277/tests/kraken/driver.html?testName=imaging-darkroom) 08:56:05 INFO - PROCESS | 1665 | RSS: Main: 251310080 08:56:05 INFO - PROCESS | 1665 | 08:56:08 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49277/tests/kraken/driver.html?testName=imaging-desaturate) 08:56:09 INFO - PROCESS | 1665 | RSS: Main: 251187200 08:56:09 INFO - PROCESS | 1665 | 08:56:12 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49277/tests/kraken/driver.html?testName=json-parse-financial) 08:56:12 INFO - PROCESS | 1665 | RSS: Main: 251854848 08:56:12 INFO - PROCESS | 1665 | 08:56:14 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49277/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:56:15 INFO - PROCESS | 1665 | RSS: Main: 251248640 08:56:15 INFO - PROCESS | 1665 | 08:56:16 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:56:17 INFO - PROCESS | 1665 | RSS: Main: 251293696 08:56:17 INFO - PROCESS | 1665 | 08:56:19 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:56:20 INFO - PROCESS | 1665 | RSS: Main: 251256832 08:56:20 INFO - PROCESS | 1665 | 08:56:23 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:56:24 INFO - PROCESS | 1665 | RSS: Main: 251342848 08:56:24 INFO - PROCESS | 1665 | 08:56:26 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:56:27 INFO - PROCESS | 1665 | RSS: Main: 251625472 08:56:27 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49277/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49277/tests/kraken/driver.html?testName=ai-astar) 08:56:29 INFO - PROCESS | 1665 | RSS: Main: 253259776 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | __start_tp_report 08:56:29 INFO - PROCESS | 1665 | _x_x_mozilla_page_load 08:56:29 INFO - PROCESS | 1665 | _x_x_mozilla_page_load_details 08:56:29 INFO - PROCESS | 1665 | |i|pagename|runs| 08:56:29 INFO - PROCESS | 1665 | |0;ai-astar;108;119;118;119;107;170;174;131;118;117 08:56:29 INFO - PROCESS | 1665 | |1;audio-beat-detection;143;112;109;145;110;113;111;109;123;132 08:56:29 INFO - PROCESS | 1665 | |2;audio-dft;198;199;198;194;192;194;197;196;195;193 08:56:29 INFO - PROCESS | 1665 | |3;audio-fft;83;57;59;83;60;58;59;59;74;58 08:56:29 INFO - PROCESS | 1665 | |4;audio-oscillator;84;72;88;74;69;70;84;69;71;88 08:56:29 INFO - PROCESS | 1665 | |5;imaging-gaussian-blur;90;88;134;87;81;133;129;76;138;134 08:56:29 INFO - PROCESS | 1665 | |6;imaging-darkroom;139;172;99;99;100;97;109;100;100;100 08:56:29 INFO - PROCESS | 1665 | |7;imaging-desaturate;92;106;150;91;119;152;92;98;128;90 08:56:29 INFO - PROCESS | 1665 | |8;json-parse-financial;55;59;56;57;58;58;59;59;61;60 08:56:29 INFO - PROCESS | 1665 | |9;json-stringify-tinderbox;66;73;75;73;67;64;70;72;71;71 08:56:29 INFO - PROCESS | 1665 | |10;stanford-crypto-aes;83;85;106;87;85;86;87;81;85;88 08:56:29 INFO - PROCESS | 1665 | |11;stanford-crypto-ccm;132;159;134;158;159;157;160;161;173;155 08:56:29 INFO - PROCESS | 1665 | |12;stanford-crypto-pbkdf2;165;168;167;166;167;164;166;172;169;168 08:56:29 INFO - PROCESS | 1665 | |13;stanford-crypto-sha256-iterative;68;70;67;71;69;65;68;67;70;69 08:56:29 INFO - PROCESS | 1665 | __end_tp_report 08:56:29 INFO - PROCESS | 1665 | __start_cc_report 08:56:29 INFO - PROCESS | 1665 | _x_x_mozilla_cycle_collect,939 08:56:29 INFO - PROCESS | 1665 | __end_cc_report 08:56:29 INFO - PROCESS | 1665 | __startTimestamp1478102189358__endTimestamp 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | ------- Summary: start ------- 08:56:29 INFO - PROCESS | 1665 | Number of tests: 14 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#0] ai-astar Cycles:10 Average:128.10 Median:119.00 stddev:24.07 (20.2%) stddev-sans-first:24.40 08:56:29 INFO - PROCESS | 1665 | Values: 108.0 119.0 118.0 119.0 107.0 170.0 174.0 131.0 118.0 117.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#1] audio-beat-detection Cycles:10 Average:120.70 Median:118.00 stddev:14.29 (12.1%) stddev-sans-first:12.68 08:56:29 INFO - PROCESS | 1665 | Values: 143.0 112.0 109.0 145.0 110.0 113.0 111.0 109.0 123.0 132.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#2] audio-dft Cycles:10 Average:195.60 Median:196.50 stddev:2.37 (1.2%) stddev-sans-first:2.35 08:56:29 INFO - PROCESS | 1665 | Values: 198.0 199.0 198.0 194.0 192.0 194.0 197.0 196.0 195.0 193.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#3] audio-fft Cycles:10 Average:65.00 Median:59.50 stddev:10.67 (17.9%) stddev-sans-first:9.11 08:56:29 INFO - PROCESS | 1665 | Values: 83.0 57.0 59.0 83.0 60.0 58.0 59.0 59.0 74.0 58.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#4] audio-oscillator Cycles:10 Average:76.90 Median:79.00 stddev:8.08 (10.2%) stddev-sans-first:8.15 08:56:29 INFO - PROCESS | 1665 | Values: 84.0 72.0 88.0 74.0 69.0 70.0 84.0 69.0 71.0 88.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#5] imaging-gaussian-blur Cycles:10 Average:109.00 Median:78.50 stddev:26.30 (33.5%) stddev-sans-first:26.98 08:56:29 INFO - PROCESS | 1665 | Values: 90.0 88.0 134.0 87.0 81.0 133.0 129.0 76.0 138.0 134.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#6] imaging-darkroom Cycles:10 Average:111.50 Median:155.50 stddev:24.66 (15.9%) stddev-sans-first:24.07 08:56:29 INFO - PROCESS | 1665 | Values: 139.0 172.0 99.0 99.0 100.0 97.0 109.0 100.0 100.0 100.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#7] imaging-desaturate Cycles:10 Average:111.80 Median:90.50 stddev:24.28 (26.8%) stddev-sans-first:24.67 08:56:29 INFO - PROCESS | 1665 | Values: 92.0 106.0 150.0 91.0 119.0 152.0 92.0 98.0 128.0 90.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#8] json-parse-financial Cycles:10 Average:58.20 Median:59.00 stddev:1.81 (3.1%) stddev-sans-first:1.51 08:56:29 INFO - PROCESS | 1665 | Values: 55.0 59.0 56.0 57.0 58.0 58.0 59.0 59.0 61.0 60.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#9] json-stringify-tinderbox Cycles:10 Average:70.20 Median:71.50 stddev:3.49 (4.9%) stddev-sans-first:3.35 08:56:29 INFO - PROCESS | 1665 | Values: 66.0 73.0 75.0 73.0 67.0 64.0 70.0 72.0 71.0 71.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#10] stanford-crypto-aes Cycles:10 Average:87.30 Median:85.50 stddev:6.88 (8.0%) stddev-sans-first:7.12 08:56:29 INFO - PROCESS | 1665 | Values: 83.0 85.0 106.0 87.0 85.0 86.0 87.0 81.0 85.0 88.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#11] stanford-crypto-ccm Cycles:10 Average:154.80 Median:159.00 stddev:12.47 (7.8%) stddev-sans-first:10.14 08:56:29 INFO - PROCESS | 1665 | Values: 132.0 159.0 134.0 158.0 159.0 157.0 160.0 161.0 173.0 155.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.20 Median:167.50 stddev:2.25 (1.3%) stddev-sans-first:2.24 08:56:29 INFO - PROCESS | 1665 | Values: 165.0 168.0 167.0 166.0 167.0 164.0 166.0 172.0 169.0 168.0 08:56:29 INFO - PROCESS | 1665 | 08:56:29 INFO - PROCESS | 1665 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.40 Median:69.00 stddev:1.78 (2.6%) stddev-sans-first:1.88 08:56:29 INFO - PROCESS | 1665 | Values: 68.0 70.0 67.0 71.0 69.0 65.0 68.0 67.0 70.0 69.0 08:56:29 INFO - PROCESS | 1665 | -------- Summary: end -------- 08:56:29 INFO - PROCESS | 1665 | 08:56:30 INFO - TEST-INFO | 1665: exit 0 08:56:30 INFO - TEST-OK | kraken | took 59555ms 08:56:30 INFO - SUITE-END | took 1172s 08:56:30 INFO - Completed test suite (00:19:32) 08:56:30 INFO - javascript benchmark 08:56:30 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7277.490589101577, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3330.3838789823867, 3377.24012097278, 3385.3060122674847, 3387.745919056071, 3393.5079413485046, 5661.716914154286, 5669.574781891354, 5689.175069614908, 5697.316322041351, 5783.103618939061, 5701.486866182043, 5764.538836893049, 5782.508486778618, 5793.565482588801, 5813.30240371156, 5248.5538729208065, 5252.52727254547, 5258.815941442051, 5300.867478313035, 5308.416074231832, 4687.203175460163, 5014.749262536877, 5234.162533994542, 5317.335333083364, 5320.9467905321035, 5108.514691104339, 5190.792368305263, 5216.295800067, 5243.528082472596, 5260.815871444481, 5163.0190263849745, 5165.0, 5188.818391356284, 5271.0, 5299.443558426348, 5202.76587553561, 5203.895922081537, 5216.139337009389, 5246.737663116829, 5258.6318957672975, 4861.611071114302, 5566.332040155166, 5755.079187330007, 5759.827205183809, 5771.711414429262, 6158.476529494954, 6166.1983942087245, 6179.876402471926, 6258.874822503524, 6320.178376811031, 6327.303996560375, 6330.493560515148, 6331.715072821688, 6348.365163483661, 6377.48980081597, 5842.883142337129, 5853.356130825606, 5879.559033072536, 5890.322612899486, 5893.616914900518, 6168.0, 6194.787544469714, 6250.74997000124, 6259.874802504016, 6268.373162683695, 5383.7846486140115, 6199.535034872402, 6207.037909124093, 6231.127642130105, 6231.2522497300615, 4858.246971719318, 6344.492440604833, 6345.428911397997, 6356.618602883842, 6371.617702937746, 5977.462028417463, 6127.433875357673, 6136.539759518054, 6207.6585787782105, 6228.719707613078, 5679.807240479546, 5850.297964244318, 6284.842878927972, 6300.117983482316, 6314.589551679126, 4939.604831613462, 4941.085899108676, 4954.826581069645, 4955.4796746341835, 5009.89980200394, 4359.476862776487, 4370.890727731832, 4384.210842048398, 4437.156940181355, 4454.955450445519, 5781.942180578225, 5917.615355001911, 5925.614835035709, 5955.970220148958, 6025.548083893726, 6184.938150618526, 6185.690715464209, 6192.102145188923, 6211.627302361872, 6230.0, 4884.535969082932, 5572.4706152915405, 5786.42135786418, 5848.210491583582, 5896.852578685567, 5451.672899625956, 5452.154915987949, 5465.699386533699, 5476.726163691799, 5510.201020851954, 5001.649884508195, 5710.65736055838, 6112.808002439481, 6312.747490100436, 6322.968385158045, 6162.661053642093, 6177.135201071944, 6264.843378915563, 6321.33625969285, 6322.430981211713, 6248.968755156195, 6306.211723534559, 6307.747690092345, 6322.46259067966, 6341.460975816923, 6200.503959683305, 6201.782937597162, 6209.96895015522, 6218.129461875432, 6227.719752611234, 5882.5293976480925, 5927.9703601481715, 6333.683315834282, 6338.809835704937, 6339.0, 6076.179715738319, 6112.663803490851, 6120.081455037822, 6195.721192546256, 6206.503479721521, 6112.449879510687, 6129.908051379144, 6152.815415537541, 6159.692015399301, 6190.0405437157315, 5801.883962320646, 5818.709064546841, 5967.791127310524, 6042.75828966854, 6051.273847138195, 5993.4006599341465, 6079.635221886701, 6099.634021958696, 6109.7861574844665, 6166.445019948226, 5987.670678112571, 6022.66875321844, 6029.849253768691, 6030.939690603213, 6071.301800293023], "value": 5691.166657309819, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [482.12734949740974, 493.95801356884664, 520.2898044169709, 524.0357741755171, 533.5038414274726, 38820.029499262535, 40382.19235615286, 40630.390544141825, 42259.36610950838, 42342.0, 41388.37917431241, 41544.79227603865, 41957.0, 42014.0, 42170.57829421705, 9758.0, 9876.0, 9911.752206194831, 9924.057214564606, 9932.801343973117, 9804.558794854212, 9898.703038908845, 9903.752406189831, 9922.007799220057, 9947.502624868765, 9921.801563968716, 9926.45404502752, 9930.553125109387, 9970.25223108266, 9992.300538962276, 9862.753431164207, 9923.801523969516, 9938.801223975552, 9942.0, 9955.0, 9805.215582753362, 9867.013298670146, 9873.210143188528, 9882.456464894429, 9906.504674766305, 39575.80212098921, 39783.40324895129, 39825.60174398277, 39859.80070099631, 39895.8005209975, 3015.381846721417, 3331.4836200388736, 3484.8083355415442, 3755.248950209969, 3779.5842457329672, 29295.414091718045, 30041.699583004327, 30119.849400752857, 30522.694773052208, 30586.69413305861, 3159.0996565978817, 3204.150900011499, 3208.230024794056, 3236.7410607151373, 3250.577424934767, 508835.0, 510851.0, 513898.0, 516806.0, 517362.0, 32064.038078857673, 45857.77071114623, 60678.696606516685, 60822.69588652117, 60971.390286097456, 32014.0, 32938.67061329404, 34049.48925766115, 34365.48451773226, 34507.82746086304, 14603.269836508132, 14738.705225895423, 14755.55733328002, 14760.63098422548, 14790.260486975609, 9608.471534065693, 11195.992360687576, 12324.568640097732, 12487.313197774029, 12616.810747838606, 6498.700259948029, 7587.468877178655, 7680.270374314431, 7718.0, 7725.8454830903065, 2731.3444773254673, 3181.347823696137, 3235.789673671251, 3240.465323221642, 3259.4947783093658, 739.3161325773638, 966.5602151021268, 967.032967032967, 1027.2603725317758, 1068.7221322456217, 29331.560026599618, 29750.0, 29974.95087671921, 30472.933447329237, 30744.0, 875.4834647557972, 957.9760505987267, 966.3139171188535, 1064.984025239622, 1097.7759797825527, 11524.827127593093, 13129.67175820593, 13597.32013399326, 16526.421575244807, 16628.83371166297, 336418.0, 357586.0, 361887.0, 362234.0, 677339.0, 56055.439445605836, 56394.43605563974, 56433.0, 56581.868362632515, 56690.43309566934, 1353.262471952788, 1354.1807206639842, 1380.2132784312846, 1380.7376598446465, 1383.75784237758, 24153.758462415855, 29894.551581725857, 31113.755449781755, 31724.524132138496, 32531.51202732008, 53779.731101344245, 53886.730566346916, 54527.0, 54531.454685452634, 54634.907301852945, 637421.8128909512, 642832.0, 643176.0, 644783.0, 648408.0, 41418.96452588589, 41730.58269417267, 42228.36657450079, 42307.576924231595, 42561.78719106385, 45888.0, 45888.08223835572, 45909.08181836412, 46133.07733845372, 46796.7660161697, 37609.0, 37651.87044388673, 39324.0, 39403.0, 39556.60443395645, 28967.855160724903, 35117.82441087778, 36652.63347366492, 38065.4290185653, 40166.598334016286, 33795.3240935175, 36963.26073478461, 37622.8118859404, 38338.6166138335, 38381.424278635284, 32960.340793184485, 34046.148846279044, 34696.653033469345, 34800.65199348075, 35038.0, 23378.883105584362, 23801.285961421185, 25939.351516212246, 26046.08838690637, 26052.869735651202], "value": 18564.809276529948, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [379.1298968866451, 382.32901258291713, 386.41377146812334, 390.77335145615547, 406.16735691831735, 18958.90520547397, 21025.894870525663, 21450.89274553629, 21564.382671299656, 21801.454963625936, 20063.498412539695, 20246.39260822174, 20446.591068178626, 20678.586428271425, 20744.48138796531, 5888.7055647217685, 5941.732622032008, 6038.788642397517, 6114.541409394291, 6126.356732543086, 4161.771102589357, 4383.6273916716955, 6036.5170786336985, 6088.178095957055, 6412.0, 6625.768098116567, 6764.864702705943, 6765.898511522331, 6778.525503214777, 6797.7960661179995, 6492.805215843508, 6706.295838936914, 6755.797326080176, 6773.559718618274, 6774.254831968479, 5263.973525162595, 5388.407275199725, 5801.100829371454, 5838.095095260199, 5844.590878638497, 21870.01584928666, 21995.120195192332, 22738.545229095325, 25682.357941051436, 26036.73963260381, 2374.0978428197345, 2412.6381042843536, 2513.5978243480954, 2712.308361367858, 2883.351245969661, 13605.863941360558, 14250.144991300554, 15270.31283592241, 15490.767638485431, 15699.450519231887, 1843.4469659102215, 1910.7133929910485, 1913.0243575776315, 1913.3303343829548, 1938.3990962801436, 111776.44111779389, 112256.0, 123481.0, 124651.0, 125903.0, 7865.370770338359, 9542.141207291377, 10946.945265273622, 11024.0, 11156.665300041012, 13521.526746563823, 13539.661508462368, 13543.45826166962, 13548.525801596898, 13565.525206617722, 8520.914790852135, 8773.210411063035, 8828.646854125891, 8897.866532002025, 8906.821863562822, 7973.9202607973175, 8805.59110542323, 8863.379563430499, 8972.820543589221, 9063.456192628464, 5804.82585522435, 6378.872422551616, 6555.934440655627, 6631.0, 6696.665166741644, 1435.7343891380128, 1576.2276484522731, 1640.7292796688412, 1831.624516974017, 1865.6548538520146, 889.3285569395065, 900.9954950225207, 941.0683423410774, 999.1357475783541, 1003.2174903575223, 17305.30778768835, 18988.43034708961, 20729.0, 20904.059317330757, 21300.25449109274, 941.684535680541, 945.8082815652327, 977.2328721953374, 981.8674478945394, 1014.0366651680932, 10846.023857852831, 11185.937335953071, 11264.267822591506, 11276.718082048015, 11362.94318528402, 498455.0, 510853.0, 572286.1385693045, 619109.0, 646504.7674761596, 128191.0, 133519.0, 134162.0, 135508.6449135496, 136578.6342136566, 964.4454438697777, 968.2447690801187, 1013.5084484025242, 1014.0214692821463, 1017.1506791828906, 15225.543233703007, 15734.449294274646, 16288.837111628733, 18000.90999544994, 19438.51403714862, 58781.0, 59004.81990360083, 59576.70211648914, 59697.0, 60313.0, 83849.0, 87173.38479845614, 90002.54998724964, 90511.0, 92822.53588732013, 6394.328595497405, 7794.22057794216, 7995.400344974034, 8205.630746616298, 8215.630296636546, 11898.643040708792, 12415.93792031034, 12599.496020159091, 12714.364281785689, 12945.093843431247, 9326.860097098413, 10080.848787268344, 10805.459727013775, 11125.666230013112, 11236.325820450798, 10993.560257589606, 11096.44517774092, 11103.111751060058, 11344.319340839576, 11351.772964540498, 5866.2373891393845, 8448.95775521143, 10063.849042264519, 11229.831552526883, 11703.356315402734, 7882.211778822072, 8036.557989310644, 8378.790530236549, 8386.119457457124, 8389.161083891562, 8546.914530854612, 10737.463126843782, 11253.493592788507, 11330.206885517935, 11541.0], "value": 9763.400213861258, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1402.6002589262062, 1487.6206567325335, 1655.776470176526, 1820.5539642787503, 1841.8066103059186, 7959.840803183933, 8229.0, 8497.91502084979, 8979.865302020475, 9001.279897608192, 8452.07027227006, 8769.7807554811, 8797.648094076229, 8875.73372798817, 8883.64465421384, 2367.396313939943, 2385.4990452005013, 2396.005657652081, 2396.616541353375, 2407.0010945457616, 2359.9882000589973, 2394.1859767678984, 2399.880005999693, 2406.8074554035634, 2407.518496300738, 2369.3721163891582, 2382.618780995041, 2393.078664714089, 2403.038784486202, 2408.2414039577475, 2349.4126468382906, 2355.0579768092816, 2368.609179485383, 2369.277370402027, 2370.1230544698487, 2329.7320808106947, 2339.754325795801, 2342.355852140658, 2347.8943447544902, 2361.3388251289666, 8826.382153249275, 8888.688895888678, 8918.375713700043, 8955.059718729504, 8996.730098097067, 5249.790008399659, 5426.5116139547235, 5429.809956651498, 5438.619296649236, 5440.564754819605, 3599.5680518337704, 3614.2771445710964, 3633.073566240592, 3635.4910312556262, 3689.0039689283744, 1090.138790355618, 1095.4413249242864, 1101.3336931156696, 1101.438266484091, 1104.1222228328497, 11487.25332853362, 11514.884851151464, 11628.76742465146, 11672.0, 11698.707532311675, 4599.402077729874, 4660.13787449323, 4829.444613869379, 4834.5890599299455, 4853.39332583427, 9986.750331241778, 10108.0, 10126.746831329276, 10131.64539241123, 10145.985401459942, 4516.1419330327135, 5382.91925621116, 5407.188921661782, 5410.161424979135, 5424.674519528841, 3730.8880733578035, 4158.875233742992, 4545.977270113628, 4788.401449818773, 4908.950910490921, 3925.842966281317, 3959.9010024749036, 4005.239004589119, 4040.4141399496907, 4077.531083925327, 1101.5593762494907, 1294.1264646363668, 1308.9593772950527, 1311.888489478405, 1315.7697402954445, 754.5698951597647, 840.7015509494164, 897.3494216692976, 903.7830920579145, 907.4147175072042, 4826.227803551415, 4860.343853579721, 5656.971715141398, 5751.281089863767, 5826.941730582725, 936.5457752989795, 952.5189779161618, 984.699666601679, 998.8002399520125, 1007.5314978534869, 3735.5704094029534, 3959.524857017119, 4017.0359113812474, 4021.4369988201674, 4035.1324465240114, 10448.902865199198, 10848.0, 10872.782544349227, 10876.184286178568, 10900.563977440814, 10088.293819432569, 10636.574537018432, 10715.19636027301, 10861.402622855661, 10951.397673128055, 8059.959700201579, 8252.587370631445, 8254.54599996994, 8285.005799304123, 8293.543855088028, 5907.852303692442, 5932.406759324205, 5989.910151347821, 6018.21763170785, 6174.44430001302, 9837.754056148653, 10005.349652272578, 10037.397756134364, 10166.796664066826, 10246.590136394461, 10148.847767283349, 10190.541425636013, 10270.33242839213, 10393.896061039293, 10418.479076046318, 6998.790036298919, 7193.280671932765, 7535.58554279498, 7555.320021198118, 7694.769156925301, 8319.708810191614, 8416.410851240355, 8428.4942903426, 8449.197326253996, 8458.154184581492, 7358.080239970004, 7421.740239091606, 7534.698612055676, 7620.8475830484185, 7696.230376962483, 7216.206217315986, 7394.371478424394, 7416.369608583331, 7424.220456851953, 7540.17058123595, 5859.296884373903, 6956.930430695831, 7039.1553013638695, 7045.26024767392, 7048.154221493453, 4972.756810797301, 5002.299678045149, 5004.899902001866, 5088.440271570198, 5113.463086375877, 5019.0, 5103.004914041875, 5108.948910510996, 5111.156659151198, 5195.168772996302], "value": 4603.630762125191, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [299.15637901118845, 304.23788410032876, 312.7373006674394, 316.9540416639586, 317.31776680137716, 4914.640972333282, 4952.479989601085, 5481.369642491115, 5572.183054607596, 5649.6892670903135, 4567.246404343279, 4908.312836202926, 5233.79064837407, 5325.840224793253, 5401.4868587484125, 3260.347930413915, 3730.160713839378, 4124.752514849104, 4162.438070860433, 4202.936955945664, 3488.9009961862057, 4180.7909604519655, 4208.622128497389, 4224.894377640553, 4252.893677658052, 3193.8722451101926, 3386.5766779152605, 4128.62842344189, 4149.273877071516, 4191.685623578229, 3402.0, 4139.565345638694, 4151.60559746825, 4170.749755014709, 4197.244495990721, 3644.817759112034, 3652.1234903623204, 3654.7807131571926, 3660.3411385950785, 3662.3224703429682, 5127.743702792803, 5247.658902171384, 5376.946230537684, 5402.756875940592, 5427.45725427458, 3954.367301231789, 4711.811527538928, 4746.5285761413725, 4774.856754297377, 4782.7130372177435, 4649.790759415834, 5583.4137415571595, 5800.24596802413, 5829.358770535237, 5866.472017518401, 3616.276744651054, 3903.3800972596337, 3910.374340105598, 3920.411938209263, 4022.5374081980362, 4957.975210123926, 5069.847904562869, 5589.909967556328, 5844.0, 6136.760082569875, 3470.288590838872, 3978.0, 3980.840766369313, 3982.561918188997, 3987.940180897289, 3638.199596088856, 3874.9806250969127, 4015.6988225883174, 4020.718549701493, 4049.311617025113, 4056.566060363758, 4268.573142685706, 4272.380504826782, 4656.95343046572, 4680.578747912636, 5211.045857803324, 5712.0860662293835, 5836.533077353802, 5842.357340692521, 5871.500922421556, 1090.8690957085041, 1129.627223016419, 1244.4710997825887, 1254.7553227120807, 1335.937929346172, 762.5843915066191, 822.6298165825402, 908.7909780750332, 909.6361455417886, 920.8848893888264, 5401.891962160735, 5441.183822426588, 5453.754581043862, 5482.806877249052, 5482.8081017165005, 5797.24635797352, 5843.444872737083, 5883.970580147072, 5970.85072873173, 5993.790217342372, 5375.16684913839, 5392.460753924576, 5416.377116631637, 5438.809641662523, 5457.754401051962, 2289.5993201189726, 2356.32844639277, 2531.0508559290265, 2619.751123643251, 2653.6152257922495, 4172.248995180897, 4329.0, 4341.5007274163245, 4765.642576806753, 4890.535399137077, 4065.3495440729935, 4561.908761824811, 4905.258633185239, 4961.984394643885, 4972.477889821589, 4798.688085274516, 5047.54243343311, 5099.082165210298, 5099.847004589868, 5100.591952643854, 4686.437627484724, 4811.639127065414, 4927.940492794067, 5018.29743835856, 5086.821961231339, 4127.111022284473, 4327.826886924488, 4724.598409135262, 4834.419869615669, 5042.445331013659, 4279.117188437078, 5099.5410413063, 5140.871478213075, 5159.690418574897, 5196.947205853742, 3201.855916483717, 3435.519027336125, 3440.36353274645, 3828.406596977473, 3973.841046358113, 5244.76398562058, 5300.893982120413, 5910.763569457174, 5954.76180952757, 6005.819825405245, 5674.432556744293, 5715.0, 5789.797357092481, 5795.740131003625, 5816.912746308724, 5419.482544887438, 5580.972095139661, 5692.658440493584, 5757.560609847538, 5765.760361522292, 4543.931841022321, 4974.253861920741, 5229.980153870111, 5552.278203833475, 5576.358718747396, 4864.148773964613, 5744.3394009687745, 5744.511716504144, 5775.768969241351, 5808.82573522795, 5362.257266388361, 5546.417626149197, 5625.690587017753, 5643.081352340224, 5700.315962084576], "value": 4000.534052692955, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [682.2972338491355, 699.8040548646379, 710.7405796884138, 728.1917072050023, 738.6085374751382, 15152.242387880604, 15590.06459612424, 15679.843201567981, 15813.209339533036, 15867.84132158678, 13656.38546265418, 13945.790813137812, 14058.226797526131, 14212.71574568508, 14217.786733198984, 844.4342290665269, 867.995660021699, 869.9347548933823, 872.8821609082788, 873.3144481581959, 687.3092541995313, 711.0, 837.2966707965307, 869.8086420987372, 873.2751815992742, 893.4460634406677, 920.392540922991, 922.128588483883, 924.0066928052337, 927.6753136402273, 904.9954750226207, 911.6262332443666, 912.7854954085784, 913.5249670171506, 920.2775820980531, 616.737886398279, 677.2753154125088, 677.3971165662564, 680.5610381304031, 681.6046692918096, 11983.820242696367, 14851.331690073972, 14854.628634284229, 14894.553163405115, 14924.70150596982, 12641.367931603383, 13937.651558711012, 14719.116852988855, 14859.331330090172, 14883.851161488463, 11610.76778464426, 11653.883461165364, 11778.823317650242, 11807.409629518575, 12222.877771222351, 3372.4266874631126, 3445.2592692571216, 3688.483612294281, 3753.6246375362243, 3948.6446219840063, 82571.5871420639, 101888.47167292496, 109189.45405273003, 109695.0, 110990.33514497208, 10854.403007834644, 10936.687597488351, 11020.283681560673, 11045.28205666629, 11055.557777688802, 20738.0, 20834.0, 20839.687404688942, 20873.26943556968, 20896.895515522327, 7607.35337496308, 7640.312371886557, 7864.898914152023, 7914.089879663798, 7966.0, 4339.631131353807, 4472.888177795516, 4604.37840891482, 4638.884027899262, 4705.435347758223, 3571.8571257149424, 3709.5548534176073, 3722.3671975764187, 3723.162288485069, 3723.1995121048562, 653.6274323635578, 655.3315618069543, 686.4268335939447, 708.7909066825299, 720.3192982631363, 575.9164921086502, 646.208394716478, 689.3141324382271, 689.396777819408, 707.7628994286869, 9743.943537539853, 9834.213262938947, 9836.747426432466, 9861.112499875046, 9886.653967111117, 580.4427749360576, 649.7368565730886, 669.5580916595023, 696.3002182806247, 709.9503034787515, 4577.450705915245, 4693.7653117344, 4709.905801884011, 4711.246200607886, 4760.976195119071, 163586.0, 167154.32845671632, 168637.0, 171784.0, 175517.0, 137561.0, 137771.6222837779, 142153.0, 142860.0, 143103.56896430903, 67300.66349668318, 92890.0, 95672.56491152638, 100372.0, 124578.0, 7841.372690184886, 9909.900900991186, 9936.602535898483, 10113.59545618167, 10239.129673977795, 58792.0, 60576.27406766618, 62326.68836655788, 63849.0, 64490.35509644844, 47813.0, 63704.36295636984, 66922.33077669161, 76471.0, 90746.54626726825, 12266.386680665753, 12616.369181540702, 13320.467181312639, 13323.933380333036, 13766.793498097337, 13795.310234488035, 13795.448182073007, 14444.638884027983, 14915.776263356276, 14974.326155323255, 13543.305513517944, 13644.181349119084, 14170.220637865017, 14271.14373137615, 14306.284685765879, 12740.87259127434, 13696.93151534236, 14225.217613031382, 14282.642933926734, 14835.10989340643, 13458.461661533429, 13640.590782276548, 13677.384517696528, 13731.45074197021, 13893.791593126314, 11224.94387528057, 11274.60538881168, 11837.0, 12101.0, 12108.878911210775, 10209.183265338903, 11330.773384532427, 11644.6506604802, 11756.647300580997, 11911.52353905834], "value": 7818.69038731189, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1524.7, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [108.0, 119.0, 118.0, 119.0, 107.0, 170.0, 174.0, 131.0, 118.0, 117.0], "value": 128.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [143.0, 112.0, 109.0, 145.0, 110.0, 113.0, 111.0, 109.0, 123.0, 132.0], "value": 120.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [198.0, 199.0, 198.0, 194.0, 192.0, 194.0, 197.0, 196.0, 195.0, 193.0], "value": 195.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 57.0, 59.0, 83.0, 60.0, 58.0, 59.0, 59.0, 74.0, 58.0], "value": 65.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 72.0, 88.0, 74.0, 69.0, 70.0, 84.0, 69.0, 71.0, 88.0], "value": 76.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [90.0, 88.0, 134.0, 87.0, 81.0, 133.0, 129.0, 76.0, 138.0, 134.0], "value": 109.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 172.0, 99.0, 99.0, 100.0, 97.0, 109.0, 100.0, 100.0, 100.0], "value": 111.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 106.0, 150.0, 91.0, 119.0, 152.0, 92.0, 98.0, 128.0, 90.0], "value": 111.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 59.0, 56.0, 57.0, 58.0, 58.0, 59.0, 59.0, 61.0, 60.0], "value": 58.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 73.0, 75.0, 73.0, 67.0, 64.0, 70.0, 72.0, 71.0, 71.0], "value": 70.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 85.0, 106.0, 87.0, 85.0, 86.0, 87.0, 81.0, 85.0, 88.0], "value": 87.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [132.0, 159.0, 134.0, 158.0, 159.0, 157.0, 160.0, 161.0, 173.0, 155.0], "value": 154.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 168.0, 167.0, 166.0, 167.0, 164.0, 166.0, 172.0, 169.0, 168.0], "value": 167.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 70.0, 67.0, 71.0, 69.0, 65.0, 68.0, 67.0, 70.0, 69.0], "value": 68.4, "unit": "score"}]}]} 08:56:30 INFO - Return code: 0 08:56:30 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:56:30 ERROR - # TBPL SUCCESS # 08:56:30 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:56:30 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:56:30 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:56:30 INFO - 2016-11-02 08:56:30.691 screenresolution[1670:10523] starting screenresolution argv=screenresolution get 08:56:30 INFO - 2016-11-02 08:56:30.693 screenresolution[1670:10523] Display 0: 1600x1200x32@60 08:56:30 INFO - 2016-11-02 08:56:30.699 screenresolution[1671:10527] starting screenresolution argv=screenresolution list 08:56:30 INFO - Available Modes on Display 0 08:56:30 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:56:30 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:56:30 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:56:30 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:56:30 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:56:30 INFO - Intel Iris: 08:56:30 INFO - Chipset Model: Intel Iris 08:56:30 INFO - Type: GPU 08:56:30 INFO - Bus: Built-In 08:56:30 INFO - VRAM (Dynamic, Max): 1536 MB 08:56:30 INFO - Vendor: Intel (0x8086) 08:56:30 INFO - Device ID: 0x0a2e 08:56:30 INFO - Revision ID: 0x0009 08:56:30 INFO - Displays: 08:56:30 INFO - Display: 08:56:30 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:56:30 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:56:30 INFO - Display Serial Number: 1600x1200 60 08:56:30 INFO - Main Display: Yes 08:56:30 INFO - Mirror: Off 08:56:30 INFO - Online: Yes 08:56:30 INFO - Rotation: Supported 08:56:30 INFO - Return code: 0 08:56:30 INFO - Running post-action listener: _resource_record_post_action 08:56:30 INFO - [mozharness: 2016-11-02 15:56:30.931135Z] Finished run-tests step (success) 08:56:30 INFO - Running post-run listener: _resource_record_post_run 08:56:30 INFO - Total resource usage - Wall time: 1205s; CPU: 54.0%; Read bytes: 37244928; Write bytes: 664553984; Read time: 236; Write time: 1892 08:56:30 INFO - TinderboxPrint: CPU usage
54.4% 08:56:30 INFO - TinderboxPrint: I/O read bytes / time
37,244,928 / 236 08:56:30 INFO - TinderboxPrint: I/O write bytes / time
664,553,984 / 1,892 08:56:30 INFO - TinderboxPrint: CPU idle
2,196.6 (45.6%) 08:56:30 INFO - TinderboxPrint: CPU system
978.3 (20.3%) 08:56:30 INFO - TinderboxPrint: CPU user
1,646.8 (34.2%) 08:56:30 INFO - TinderboxPrint: Swap in / out
400,994,304 / 0 08:56:30 INFO - install - Wall time: 32s; CPU: 54.0%; Read bytes: 358717952; Write bytes: 355276288; Read time: 27522; Write time: 697 08:56:31 INFO - run-tests - Wall time: 1174s; CPU: 54.0%; Read bytes: 35217408; Write bytes: 298165248; Read time: 218; Write time: 1155 08:56:31 INFO - Running post-run listener: _upload_blobber_files 08:56:31 INFO - Blob upload gear active. 08:56:31 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:56:31 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 08:56:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:56:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:56:31 INFO - (blobuploader) - INFO - Open directory for files ... 08:56:31 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 08:56:31 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:56:31 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:56:32 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 08:56:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:56:32 INFO - (blobuploader) - INFO - Done attempting. 08:56:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 08:56:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:56:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:56:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 08:56:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:56:33 INFO - (blobuploader) - INFO - Done attempting. 08:56:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:56:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:56:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:56:36 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:56:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:56:36 INFO - (blobuploader) - INFO - Done attempting. 08:56:36 INFO - (blobuploader) - INFO - Iteration through files over. 08:56:36 INFO - Return code: 0 08:56:36 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:56:36 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:56:36 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/991739fdb26f62d6e39aa1d0dd2c6e133b62d5f02b332f6a64da2409b8d888e4ad1a1b888622bad09482e87c7b8ceff50cc136441f792c1a80d5fcfefd170902", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/586716a7494672bde1689b2d05e1cc79bf265191af955c0c300b93534922958e643eeeda12094036160a8a6176a5dbb1df348426b8df4322720917dacfb7156e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6671cd8b60fa97d14140fdb6e4d7bf8e3ec1155df1299aa7c914228628b544079b879cc01d639c021e2342b767bf7205e663fad39d2ec1080cf3a4f6f3991183"} 08:56:36 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:56:36 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:56:36 INFO - Contents: 08:56:36 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/991739fdb26f62d6e39aa1d0dd2c6e133b62d5f02b332f6a64da2409b8d888e4ad1a1b888622bad09482e87c7b8ceff50cc136441f792c1a80d5fcfefd170902", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/586716a7494672bde1689b2d05e1cc79bf265191af955c0c300b93534922958e643eeeda12094036160a8a6176a5dbb1df348426b8df4322720917dacfb7156e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6671cd8b60fa97d14140fdb6e4d7bf8e3ec1155df1299aa7c914228628b544079b879cc01d639c021e2342b767bf7205e663fad39d2ec1080cf3a4f6f3991183"} 08:56:36 INFO - Running post-run listener: copy_logs_to_upload_dir 08:56:36 INFO - Copying logs to upload dir... 08:56:36 INFO - mkdir: /builds/slave/test/build/upload/logs 08:56:36 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1266.749260 ========= master_lag: 0.06 ========= ========= Finished '/tools/buildbot/bin/python -u ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2016-11-02 08:56:36.370556) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-02 08:56:36.374280) ========= 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.SSsbR8AGKN/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.VAfti0hYAO/Listeners TMPDIR=/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/991739fdb26f62d6e39aa1d0dd2c6e133b62d5f02b332f6a64da2409b8d888e4ad1a1b888622bad09482e87c7b8ceff50cc136441f792c1a80d5fcfefd170902", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/586716a7494672bde1689b2d05e1cc79bf265191af955c0c300b93534922958e643eeeda12094036160a8a6176a5dbb1df348426b8df4322720917dacfb7156e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6671cd8b60fa97d14140fdb6e4d7bf8e3ec1155df1299aa7c914228628b544079b879cc01d639c021e2342b767bf7205e663fad39d2ec1080cf3a4f6f3991183"} build_url:https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010488 build_url: 'https://queue.taskcluster.net/v1/task/KfAlWwQuQuCh7WWQmrzQrA/artifacts/public/build/firefox-51.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/991739fdb26f62d6e39aa1d0dd2c6e133b62d5f02b332f6a64da2409b8d888e4ad1a1b888622bad09482e87c7b8ceff50cc136441f792c1a80d5fcfefd170902", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/586716a7494672bde1689b2d05e1cc79bf265191af955c0c300b93534922958e643eeeda12094036160a8a6176a5dbb1df348426b8df4322720917dacfb7156e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6671cd8b60fa97d14140fdb6e4d7bf8e3ec1155df1299aa7c914228628b544079b879cc01d639c021e2342b767bf7205e663fad39d2ec1080cf3a4f6f3991183"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-02 08:56:36.406916) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-02 08:56:36.407234) ========= 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.SSsbR8AGKN/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.VAfti0hYAO/Listeners TMPDIR=/var/folders/p5/ggm4rr852vvd80d664drn_0m00000w/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.005183 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-02 08:56:36.455673) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-02 08:56:36.456014) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-02 08:56:36.456338) ========= ========= Total master_lag: 1.20 =========