builder: mozilla-aurora_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0109 starttime: 1458899539.54 results: success (0) buildid: 20160325004031 builduid: 20fe4cdd11004459b718aad102472367 revision: a4481ccef67e4732e005b3538df8d8e61890bcdc ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.539181) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.539540) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.539832) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 /builds/slave/test program finished with exit code 0 elapsedTime=0.005312 basedir: '/builds/slave/test' ========= master_lag: 0.10 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.641416) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.641693) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.847130) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.847442) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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.005292 ========= master_lag: 0.08 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.929686) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.929962) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.930313) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:19.930581) ========= 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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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-03-25 02:52:19-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 26.3M=0s 2016-03-25 02:52:20 (26.3 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.544609 ========= master_lag: 0.09 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:20.565963) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:20.566262) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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.027402 ========= master_lag: 0.10 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:20.692832) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:20.693181) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev a4481ccef67e4732e005b3538df8d8e61890bcdc --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 a4481ccef67e4732e005b3538df8d8e61890bcdc --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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-03-25 02:52:20,782 truncating revision to first 12 chars 2016-03-25 02:52:20,782 Setting DEBUG logging. 2016-03-25 02:52:20,782 attempt 1/10 2016-03-25 02:52:20,782 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/a4481ccef67e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-25 02:52:21,493 unpacking tar archive at: mozilla-aurora-a4481ccef67e/testing/mozharness/ program finished with exit code 0 elapsedTime=0.962338 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:21.687826) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:21.688130) ========= echo a4481ccef67e4732e005b3538df8d8e61890bcdc in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'a4481ccef67e4732e005b3538df8d8e61890bcdc'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 a4481ccef67e4732e005b3538df8d8e61890bcdc program finished with exit code 0 elapsedTime=0.005721 script_repo_revision: 'a4481ccef67e4732e005b3538df8d8e61890bcdc' ========= master_lag: 0.10 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:21.790166) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:21.790469) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-25 02:52:21.992106) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 24 secs) (at 2016-03-25 02:52:21.992411) ========= /tools/buildbot/bin/python 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', '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:52:22 INFO - MultiFileLogger online at 20160325 02:52:22 in /builds/slave/test 02:52:22 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 02:52:22 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:52:22 INFO - {'append_to_log': False, 02:52:22 INFO - 'base_work_dir': '/builds/slave/test', 02:52:22 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 02:52:22 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:52:22 INFO - 'branch': 'Mozilla-Aurora', 02:52:22 INFO - 'buildbot_json_path': 'buildprops.json', 02:52:22 INFO - 'config_files': ('talos/mac_config.py',), 02:52:22 INFO - 'default_actions': ('clobber', 02:52:22 INFO - 'read-buildbot-config', 02:52:22 INFO - 'download-and-extract', 02:52:22 INFO - 'populate-webroot', 02:52:22 INFO - 'create-virtualenv', 02:52:22 INFO - 'install', 02:52:22 INFO - 'run-tests'), 02:52:22 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:52:22 INFO - 'download_minidump_stackwalk': True, 02:52:22 INFO - 'download_symbols': 'ondemand', 02:52:22 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 02:52:22 INFO - 'tooltool.py': '/tools/tooltool.py', 02:52:22 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 02:52:22 INFO - '/tools/misc-python/virtualenv.py')}, 02:52:22 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:52:22 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:52:22 INFO - 'installer_path': 'installer.exe', 02:52:22 INFO - 'log_level': 'info', 02:52:22 INFO - 'log_name': 'talos', 02:52:22 INFO - 'log_to_console': True, 02:52:22 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 02:52:22 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 02:52:22 INFO - 'opt_config_files': (), 02:52:22 INFO - 'pip_index': False, 02:52:22 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 02:52:22 INFO - 'cmd': ('bash', 02:52:22 INFO - '-c', 02:52:22 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 02:52:22 INFO - 'enabled': True, 02:52:22 INFO - 'halt_on_failure': False, 02:52:22 INFO - 'name': 'check_screen_resolution'},), 02:52:22 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 02:52:22 INFO - 'cmd': ('bash', 02:52:22 INFO - '-c', 02:52:22 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 02:52:22 INFO - 'enabled': True, 02:52:22 INFO - 'halt_on_failure': False, 02:52:22 INFO - 'name': 'check_screen_resolution'},), 02:52:22 INFO - 'run_cmd_checks_enabled': True, 02:52:22 INFO - 'sps_profile': False, 02:52:22 INFO - 'sps_profile_interval': 0, 02:52:22 INFO - 'suite': 'dromaeojs-e10s', 02:52:22 INFO - 'system_bits': '32', 02:52:22 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:52:22 INFO - 'title': 't-yosemite-r7-0109', 02:52:22 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:52:22 INFO - 'use_talos_json': True, 02:52:22 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:52:22 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:52:22 INFO - 'work_dir': 'build'} 02:52:22 INFO - ##### 02:52:22 INFO - ##### Running clobber step. 02:52:22 INFO - ##### 02:52:22 INFO - Running pre-action listener: _resource_record_pre_action 02:52:22 INFO - Running main action method: clobber 02:52:22 INFO - rmtree: /builds/slave/test/build 02:52:22 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:52:23 INFO - Running post-action listener: _resource_record_post_action 02:52:23 INFO - ##### 02:52:23 INFO - ##### Running read-buildbot-config step. 02:52:23 INFO - ##### 02:52:23 INFO - Running pre-action listener: _resource_record_pre_action 02:52:23 INFO - Running main action method: read_buildbot_config 02:52:23 INFO - Using buildbot properties: 02:52:23 INFO - { 02:52:23 INFO - "project": "", 02:52:23 INFO - "product": "firefox", 02:52:23 INFO - "script_repo_revision": "production", 02:52:23 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs-e10s", 02:52:23 INFO - "repository": "", 02:52:23 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs-e10s", 02:52:23 INFO - "buildid": "20160325004031", 02:52:23 INFO - "stage_platform": "macosx64", 02:52:23 INFO - "basedir": "/builds/slave/test", 02:52:23 INFO - "nightly_build": "True", 02:52:23 INFO - "buildnumber": 236, 02:52:23 INFO - "slavename": "t-yosemite-r7-0109", 02:52:23 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 02:52:23 INFO - "platform": "yosemite_r7", 02:52:23 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 02:52:23 INFO - "branch": "mozilla-aurora", 02:52:23 INFO - "repo_path": "releases/mozilla-aurora", 02:52:23 INFO - "revision": "a4481ccef67e4732e005b3538df8d8e61890bcdc", 02:52:23 INFO - "pgo_build": "False", 02:52:23 INFO - "builduid": "20fe4cdd11004459b718aad102472367", 02:52:23 INFO - "slavebuilddir": "test" 02:52:23 INFO - } 02:52:23 INFO - Found installer url https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg. 02:52:23 INFO - Running post-action listener: _resource_record_post_action 02:52:23 INFO - ##### 02:52:23 INFO - ##### Running download-and-extract step. 02:52:23 INFO - ##### 02:52:23 INFO - Running pre-action listener: _resource_record_pre_action 02:52:23 INFO - Running main action method: download_and_extract 02:52:23 INFO - mkdir: /builds/slave/test/build/tests 02:52: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:52:23 INFO - https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json matches https://queue.taskcluster.net 02:52:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json 02:52:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json 02:52:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-47.0a2.en-US.mac.test_packages.json 02:52:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.mac.test_packages.json'}, attempt #1 02:52:54 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json: timed out 02:52:54 INFO - retry: attempt #1 caught exception: timed out 02:52:54 INFO - retry: Failed, sleeping 30 seconds before retrying 02:53:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.mac.test_packages.json'}, attempt #2 02:53:37 INFO - Downloaded 1277 bytes. 02:53:37 INFO - Reading from file /builds/slave/test/build/firefox-47.0a2.en-US.mac.test_packages.json 02:53:37 INFO - Using the following test package requirements: 02:53:37 INFO - {u'common': [u'firefox-47.0a2.en-US.mac.common.tests.zip'], 02:53:37 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 02:53:37 INFO - u'firefox-47.0a2.en-US.mac.cppunittest.tests.zip'], 02:53:37 INFO - u'gtest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 02:53:37 INFO - u'firefox-47.0a2.en-US.mac.gtest.tests.zip'], 02:53:37 INFO - u'jittest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 02:53:37 INFO - u'jsshell-mac.zip'], 02:53:37 INFO - u'mochitest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 02:53:37 INFO - u'firefox-47.0a2.en-US.mac.mochitest.tests.zip'], 02:53:37 INFO - u'mozbase': [u'firefox-47.0a2.en-US.mac.common.tests.zip'], 02:53:37 INFO - u'reftest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 02:53:37 INFO - u'firefox-47.0a2.en-US.mac.reftest.tests.zip'], 02:53:37 INFO - u'talos': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 02:53:37 INFO - u'firefox-47.0a2.en-US.mac.talos.tests.zip'], 02:53:37 INFO - u'web-platform': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 02:53:37 INFO - u'firefox-47.0a2.en-US.mac.web-platform.tests.zip'], 02:53:37 INFO - u'webapprt': [u'firefox-47.0a2.en-US.mac.common.tests.zip'], 02:53:37 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 02:53:37 INFO - u'firefox-47.0a2.en-US.mac.xpcshell.tests.zip']} 02:53:37 INFO - Downloading packages: [u'firefox-47.0a2.en-US.mac.common.tests.zip'] for test suite category: common 02:53:37 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:53:37 INFO - https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 02:53:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip 02:53:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip 02:53:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip 02:53:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip'}, attempt #1 02:53:49 INFO - Downloaded 17869157 bytes. 02:53:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 02:53:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 02:53:52 INFO - Return code: 0 02:53:52 INFO - Downloading packages: [u'firefox-47.0a2.en-US.mac.common.tests.zip', u'firefox-47.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 02:53:52 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:53:52 INFO - https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 02:53:52 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip 02:53:52 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip 02:53:52 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip 02:53:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip'}, attempt #1 02:53:54 INFO - Downloaded 17869157 bytes. 02:53:54 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 02:53:54 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 02:53:57 INFO - Return code: 0 02:53: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:53:57 INFO - https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 02:53:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip 02:53:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip 02:53:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.mac.talos.tests.zip 02:53:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.talos.tests.zip'}, attempt #1 02:53:59 INFO - Downloaded 10845161 bytes. 02:53:59 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 02:53:59 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 02:53:59 INFO - Return code: 0 02:53:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:53:59 INFO - https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg matches https://queue.taskcluster.net 02:53:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg 02:53:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg 02:53:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-47.0a2.en-US.mac.dmg 02:53:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.mac.dmg'}, attempt #1 02:54:03 INFO - Downloaded 115146723 bytes. 02:54:03 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg 02:54:03 INFO - mkdir: /builds/slave/test/properties 02:54:03 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:54:03 INFO - Writing to file /builds/slave/test/properties/build_url 02:54:03 INFO - Contents: 02:54:03 INFO - build_url:https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg 02:54:04 INFO - Running post-action listener: _resource_record_post_action 02:54:04 INFO - Running post-action listener: set_extra_try_arguments 02:54:04 INFO - ##### 02:54:04 INFO - ##### Running populate-webroot step. 02:54:04 INFO - ##### 02:54:04 INFO - Running pre-action listener: _resource_record_pre_action 02:54:04 INFO - Running main action method: populate_webroot 02:54:04 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 02:54:04 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 02:54:04 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 02:54:04 INFO - '--tppagecycles', 02:54:04 INFO - '7'], 02:54:04 INFO - 'tests': ['tsvgm']}}, 02:54:04 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 02:54:04 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['tresize', 'tcanvasmark']}, 02:54:04 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 02:54:04 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['dromaeo_css', 'kraken']}, 02:54:04 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:54:04 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:54:04 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:54:04 INFO - 'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:54:04 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:54:04 INFO - 'tests': ['damp', 'tps']}, 02:54:04 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:54:04 INFO - 'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['damp', 'tps']}, 02:54:04 INFO - 'g3': {'tests': ['dromaeo_dom']}, 02:54:04 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:54:04 INFO - 'other': {'tests': ['a11yr', 02:54:04 INFO - 'ts_paint', 02:54:04 INFO - 'tpaint', 02:54:04 INFO - 'sessionrestore', 02:54:04 INFO - 'sessionrestore_no_auto_restore', 02:54:04 INFO - 'tabpaint']}, 02:54:04 INFO - 'other-e10s': {'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['a11yr', 02:54:04 INFO - 'ts_paint', 02:54:04 INFO - 'tpaint', 02:54:04 INFO - 'sessionrestore', 02:54:04 INFO - 'sessionrestore_no_auto_restore', 02:54:04 INFO - 'tabpaint']}, 02:54:04 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['a11yr', 02:54:04 INFO - 'ts_paint', 02:54:04 INFO - 'tpaint', 02:54:04 INFO - 'sessionrestore', 02:54:04 INFO - 'sessionrestore_no_auto_restore', 02:54:04 INFO - 'tabpaint']}, 02:54:04 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['a11yr', 02:54:04 INFO - 'ts_paint', 02:54:04 INFO - 'tpaint', 02:54:04 INFO - 'sessionrestore', 02:54:04 INFO - 'sessionrestore_no_auto_restore', 02:54:04 INFO - 'tabpaint']}, 02:54:04 INFO - 'other_l64': {'tests': ['a11yr', 02:54:04 INFO - 'ts_paint', 02:54:04 INFO - 'tpaint', 02:54:04 INFO - 'sessionrestore', 02:54:04 INFO - 'sessionrestore_no_auto_restore', 02:54:04 INFO - 'tabpaint']}, 02:54:04 INFO - 'other_nol64': {'tests': ['a11yr', 02:54:04 INFO - 'ts_paint', 02:54:04 INFO - 'tpaint', 02:54:04 INFO - 'sessionrestore', 02:54:04 INFO - 'sessionrestore_no_auto_restore', 02:54:04 INFO - 'tabpaint']}, 02:54:04 INFO - 'svgr': {'tests': ['tsvgx', 02:54:04 INFO - 'tsvgr_opacity', 02:54:04 INFO - 'tart', 02:54:04 INFO - 'tscrollx', 02:54:04 INFO - 'cart']}, 02:54:04 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['tsvgx', 02:54:04 INFO - 'tsvgr_opacity', 02:54:04 INFO - 'tart', 02:54:04 INFO - 'tscrollx', 02:54:04 INFO - 'cart']}, 02:54:04 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:54:04 INFO - 'tests': ['tp5o']}, 02:54:04 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:54:04 INFO - 'talos_options': ['--e10s'], 02:54:04 INFO - 'tests': ['tp5o']}, 02:54:04 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:54:04 INFO - 'talos_options': ['--xperf_path', 02:54:04 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:54:04 INFO - 'tests': ['tp5n']}, 02:54:04 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:54:04 INFO - 'talos_options': ['--e10s', 02:54:04 INFO - '--xperf_path', 02:54:04 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:54:04 INFO - 'tests': ['tp5n']}}, 02:54:04 INFO - 'talos.zip': {'path': '', 02:54:04 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 02:54:04 INFO - Running post-action listener: _resource_record_post_action 02:54:04 INFO - ##### 02:54:04 INFO - ##### Running create-virtualenv step. 02:54:04 INFO - ##### 02:54:04 INFO - Running pre-action listener: _resource_record_pre_action 02:54:04 INFO - Running main action method: create_virtualenv 02:54:04 INFO - Creating virtualenv /builds/slave/test/build/venv 02:54:04 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 02:54:04 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 02:54:05 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:54:05 INFO - Using real prefix '/tools/python27' 02:54:05 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:54:05 INFO - Installing distribute.............................................................................................................................................................................................done. 02:54:08 INFO - Installing pip.................done. 02:54:08 INFO - Return code: 0 02:54:08 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:54: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54: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', 'pip>=1.5'] in /builds/slave/test/build 02:54: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 pip>=1.5 02:54:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:08 INFO - 'HOME': '/Users/cltbld', 02:54:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:08 INFO - 'LOGNAME': 'cltbld', 02:54:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:08 INFO - 'MOZ_NO_REMOTE': '1', 02:54:08 INFO - 'NO_EM_RESTART': '1', 02:54:08 INFO - 'PAGER': '/bin/cat', 02:54:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:08 INFO - 'PWD': '/builds/slave/test', 02:54:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:08 INFO - 'SHELL': '/bin/bash', 02:54:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:08 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:08 INFO - 'USER': 'cltbld', 02:54:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:08 INFO - 'XPC_FLAGS': '0x0', 02:54:08 INFO - 'XPC_SERVICE_NAME': '0', 02:54:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:09 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 02:54:09 INFO - Cleaning up... 02:54:09 INFO - Return code: 0 02:54:09 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 02:54:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:09 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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54:09 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>=0.7.1'] in /builds/slave/test/build 02:54:09 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>=0.7.1 02:54:09 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:09 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:09 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:09 INFO - 'HOME': '/Users/cltbld', 02:54:09 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:09 INFO - 'LOGNAME': 'cltbld', 02:54:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:09 INFO - 'MOZ_NO_REMOTE': '1', 02:54:09 INFO - 'NO_EM_RESTART': '1', 02:54:09 INFO - 'PAGER': '/bin/cat', 02:54:09 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:09 INFO - 'PWD': '/builds/slave/test', 02:54:09 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:09 INFO - 'SHELL': '/bin/bash', 02:54:09 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:09 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:09 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:09 INFO - 'USER': 'cltbld', 02:54:09 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:09 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:09 INFO - 'XPC_FLAGS': '0x0', 02:54:09 INFO - 'XPC_SERVICE_NAME': '0', 02:54:09 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:09 INFO - Downloading/unpacking psutil>=0.7.1 02:54:09 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 02:54:09 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 02:54:09 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 02:54:09 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 02:54:09 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 02:54:09 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 02:54:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:54:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:54:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:54:11 INFO - Installing collected packages: psutil 02:54:11 INFO - Running setup.py install for psutil 02:54:11 INFO - building 'psutil._psutil_osx' extension 02:54:11 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 02:54:12 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 02:54:12 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 02:54:12 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 02:54:12 INFO - building 'psutil._psutil_posix' extension 02:54:12 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 02:54:12 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 02:54:12 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 02:54:12 INFO - ^ 02:54:12 INFO - 1 warning generated. 02:54:12 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 02:54:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:54:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:54:12 INFO - Successfully installed psutil 02:54:12 INFO - Cleaning up... 02:54:13 INFO - Return code: 0 02:54:13 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 02:54: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 02:54:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 02:54:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:13 INFO - 'HOME': '/Users/cltbld', 02:54:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:13 INFO - 'LOGNAME': 'cltbld', 02:54:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:13 INFO - 'MOZ_NO_REMOTE': '1', 02:54:13 INFO - 'NO_EM_RESTART': '1', 02:54:13 INFO - 'PAGER': '/bin/cat', 02:54:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:13 INFO - 'PWD': '/builds/slave/test', 02:54:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:13 INFO - 'SHELL': '/bin/bash', 02:54:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:13 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:13 INFO - 'USER': 'cltbld', 02:54:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:13 INFO - 'XPC_FLAGS': '0x0', 02:54:13 INFO - 'XPC_SERVICE_NAME': '0', 02:54:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:13 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 02:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:54:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:54:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:54:15 INFO - Downloading mozsystemmonitor-0.0.tar.gz 02:54:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:54:15 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 02:54:15 INFO - Installing collected packages: mozsystemmonitor 02:54:15 INFO - Running setup.py install for mozsystemmonitor 02:54:15 INFO - Successfully installed mozsystemmonitor 02:54:15 INFO - Cleaning up... 02:54:15 INFO - Return code: 0 02:54:15 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:54:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 02:54:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 02:54:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:15 INFO - 'HOME': '/Users/cltbld', 02:54:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:15 INFO - 'LOGNAME': 'cltbld', 02:54:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:15 INFO - 'MOZ_NO_REMOTE': '1', 02:54:15 INFO - 'NO_EM_RESTART': '1', 02:54:15 INFO - 'PAGER': '/bin/cat', 02:54:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:15 INFO - 'PWD': '/builds/slave/test', 02:54:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:15 INFO - 'SHELL': '/bin/bash', 02:54:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:15 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:15 INFO - 'USER': 'cltbld', 02:54:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:15 INFO - 'XPC_FLAGS': '0x0', 02:54:15 INFO - 'XPC_SERVICE_NAME': '0', 02:54:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:16 INFO - Downloading/unpacking blobuploader==1.2.4 02:54:16 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 02:54:16 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 02:54:16 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 02:54:16 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 02:54:16 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 02:54:16 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 02:54:18 INFO - Downloading blobuploader-1.2.4.tar.gz 02:54:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:54:18 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:54:18 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 02:54:18 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 02:54:18 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 02:54:18 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 02:54:18 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 02:54:18 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 02:54:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:54:19 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:54:19 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 02:54:19 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 02:54:19 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 02:54:19 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 02:54:19 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 02:54:19 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 02:54:19 INFO - Downloading docopt-0.6.1.tar.gz 02:54:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:54:19 INFO - Installing collected packages: blobuploader, requests, docopt 02:54:19 INFO - Running setup.py install for blobuploader 02:54:19 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:54:19 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:54:19 INFO - Running setup.py install for requests 02:54:20 INFO - Running setup.py install for docopt 02:54:20 INFO - Successfully installed blobuploader requests docopt 02:54:20 INFO - Cleaning up... 02:54:20 INFO - Return code: 0 02:54:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:54:20 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:20 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:20 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 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54:20 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 02:54:20 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 02:54:20 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:20 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:20 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:20 INFO - 'HOME': '/Users/cltbld', 02:54:20 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:20 INFO - 'LOGNAME': 'cltbld', 02:54:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:20 INFO - 'MOZ_NO_REMOTE': '1', 02:54:20 INFO - 'NO_EM_RESTART': '1', 02:54:20 INFO - 'PAGER': '/bin/cat', 02:54:20 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:20 INFO - 'PWD': '/builds/slave/test', 02:54:20 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:20 INFO - 'SHELL': '/bin/bash', 02:54:20 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:20 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:20 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:20 INFO - 'USER': 'cltbld', 02:54:20 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:20 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:20 INFO - 'XPC_FLAGS': '0x0', 02:54:20 INFO - 'XPC_SERVICE_NAME': '0', 02:54:20 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:54:20 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-vR4nW0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-9_0N4p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-5qB6a1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-BEKH_9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-67VbXG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-1HzeIs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-ZXCgF3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-vT2VME-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-QOtAmD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-9kK31E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:54:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:54:21 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-xwnu3i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:54:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:54:22 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-EO3Q_c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:54:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:54:22 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-vYVq7e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:54:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:54:22 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-1f8rtR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:54:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:54:22 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-YIL2XT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:54:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:54:22 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-S6wh0v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:54:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:54:22 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-4Z5qVa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:54:22 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:54:22 INFO - Running setup.py install for manifestparser 02:54:22 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:54:22 INFO - Running setup.py install for mozcrash 02:54:22 INFO - Running setup.py install for mozdebug 02:54:23 INFO - Running setup.py install for mozdevice 02:54:23 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 02:54:23 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:54:23 INFO - Running setup.py install for mozfile 02:54:23 INFO - Running setup.py install for mozhttpd 02:54:23 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:54:23 INFO - Running setup.py install for mozinfo 02:54:23 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:54:23 INFO - Running setup.py install for mozInstall 02:54:23 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:54:23 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:54:23 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:54:23 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:54:23 INFO - Running setup.py install for mozleak 02:54:23 INFO - Running setup.py install for mozlog 02:54:24 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:54:24 INFO - Running setup.py install for moznetwork 02:54:24 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:54:24 INFO - Running setup.py install for mozprocess 02:54:24 INFO - Running setup.py install for mozprofile 02:54:24 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:54:24 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:54:24 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:54:24 INFO - Running setup.py install for mozrunner 02:54:24 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:54:24 INFO - Running setup.py install for mozscreenshot 02:54:24 INFO - Running setup.py install for moztest 02:54:25 INFO - Running setup.py install for mozversion 02:54:25 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:54:25 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:54:25 INFO - Cleaning up... 02:54:25 INFO - Return code: 0 02:54:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:54:25 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:25 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:25 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 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54:25 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 02:54:25 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 02:54:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:25 INFO - 'HOME': '/Users/cltbld', 02:54:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:25 INFO - 'LOGNAME': 'cltbld', 02:54:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:25 INFO - 'MOZ_NO_REMOTE': '1', 02:54:25 INFO - 'NO_EM_RESTART': '1', 02:54:25 INFO - 'PAGER': '/bin/cat', 02:54:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:25 INFO - 'PWD': '/builds/slave/test', 02:54:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:25 INFO - 'SHELL': '/bin/bash', 02:54:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:25 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:25 INFO - 'USER': 'cltbld', 02:54:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:25 INFO - 'XPC_FLAGS': '0x0', 02:54:25 INFO - 'XPC_SERVICE_NAME': '0', 02:54:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:54:25 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-SmwyeC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:54:25 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)) 02:54:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:54:25 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-Yc02RN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:54:25 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)) 02:54:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:54:25 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-EvsiiO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:54:25 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)) 02:54:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:54:25 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-RalJRs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:54:25 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)) 02:54:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:54:25 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-2SdN2q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:54:26 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-9d2Mpf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:54:26 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-lNPBHW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:54:26 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-ld1PAr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:54:26 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-dgAicq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:54:26 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-riaiAs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:54:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-_JCcXA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:54:26 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-kjoZJQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:54:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-ZPcPTm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:54:26 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)) 02:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:54:26 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-db9Ryt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:54:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 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)) 02:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:54:27 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-yNtCUR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:54:27 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)) 02:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:54:27 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-PbumtZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:54:27 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)) 02:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:54:27 INFO - Running setup.py (path:/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/pip-xd8qRm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:54:27 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)) 02:54:27 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)) 02:54:27 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)) 02:54:27 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)) 02:54:27 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)) 02:54:27 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)) 02:54:27 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:54:27 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 02:54:27 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 02:54:27 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 02:54:27 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 02:54:27 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 02:54:27 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 02:54:30 INFO - Downloading blessings-1.6.tar.gz 02:54:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:54:30 INFO - Installing collected packages: blessings 02:54:30 INFO - Running setup.py install for blessings 02:54:30 INFO - Successfully installed blessings 02:54:30 INFO - Cleaning up... 02:54:30 INFO - Return code: 0 02:54:30 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:54:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:54:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:54:30 INFO - Reading from file tmpfile_stdout 02:54:30 INFO - Current package versions: 02:54:30 INFO - blessings == 1.6 02:54:30 INFO - blobuploader == 1.2.4 02:54:30 INFO - docopt == 0.6.1 02:54:30 INFO - manifestparser == 1.1 02:54:30 INFO - mozInstall == 1.12 02:54:30 INFO - mozcrash == 0.17 02:54:30 INFO - mozdebug == 0.1 02:54:30 INFO - mozdevice == 0.48 02:54:30 INFO - mozfile == 1.2 02:54:30 INFO - mozhttpd == 0.7 02:54:30 INFO - mozinfo == 0.9 02:54:30 INFO - mozleak == 0.1 02:54:30 INFO - mozlog == 3.1 02:54:30 INFO - moznetwork == 0.27 02:54:30 INFO - mozprocess == 0.22 02:54:30 INFO - mozprofile == 0.28 02:54:30 INFO - mozrunner == 6.11 02:54:30 INFO - mozscreenshot == 0.1 02:54:30 INFO - mozsystemmonitor == 0.0 02:54:30 INFO - moztest == 0.7 02:54:30 INFO - mozversion == 1.4 02:54:30 INFO - psutil == 3.1.1 02:54:30 INFO - requests == 1.2.3 02:54:30 INFO - wsgiref == 0.1.2 02:54:30 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:54:30 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:30 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:30 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 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54:30 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 02:54:30 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 02:54:30 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:30 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:30 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:30 INFO - 'HOME': '/Users/cltbld', 02:54:30 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:30 INFO - 'LOGNAME': 'cltbld', 02:54:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:30 INFO - 'MOZ_NO_REMOTE': '1', 02:54:30 INFO - 'NO_EM_RESTART': '1', 02:54:30 INFO - 'PAGER': '/bin/cat', 02:54:30 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:30 INFO - 'PWD': '/builds/slave/test', 02:54:30 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:30 INFO - 'SHELL': '/bin/bash', 02:54:30 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:30 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:30 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:30 INFO - 'USER': 'cltbld', 02:54:30 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:30 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:30 INFO - 'XPC_FLAGS': '0x0', 02:54:30 INFO - 'XPC_SERVICE_NAME': '0', 02:54:30 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 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)) 02:54:31 INFO - Cleaning up... 02:54:31 INFO - Return code: 0 02:54:31 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:54: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:31 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 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54:31 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 02:54:31 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 02:54:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:31 INFO - 'HOME': '/Users/cltbld', 02:54:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:31 INFO - 'LOGNAME': 'cltbld', 02:54:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:31 INFO - 'MOZ_NO_REMOTE': '1', 02:54:31 INFO - 'NO_EM_RESTART': '1', 02:54:31 INFO - 'PAGER': '/bin/cat', 02:54:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:31 INFO - 'PWD': '/builds/slave/test', 02:54:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:31 INFO - 'SHELL': '/bin/bash', 02:54:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:31 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:31 INFO - 'USER': 'cltbld', 02:54:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:31 INFO - 'XPC_FLAGS': '0x0', 02:54:31 INFO - 'XPC_SERVICE_NAME': '0', 02:54:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:31 INFO - Downloading/unpacking jsonschema 02:54:31 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 02:54:31 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 02:54:31 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 02:54:31 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 02:54:31 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 02:54:31 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 02:54:33 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:54:33 INFO - Downloading/unpacking functools32 (from jsonschema) 02:54:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:54:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:54:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:54:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:54:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:54:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:54:34 INFO - Downloading functools32-3.2.3-2.tar.gz 02:54:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:54:34 INFO - warning: no files found matching '*.txt' 02:54:34 INFO - no previously-included directories found matching 'build' 02:54:34 INFO - no previously-included directories found matching 'dist' 02:54:34 INFO - no previously-included directories found matching '.git*' 02:54:34 INFO - Installing collected packages: jsonschema, functools32 02:54:34 INFO - Running setup.py install for functools32 02:54:34 INFO - warning: no files found matching '*.txt' 02:54:34 INFO - no previously-included directories found matching 'build' 02:54:34 INFO - no previously-included directories found matching 'dist' 02:54:34 INFO - no previously-included directories found matching '.git*' 02:54:34 INFO - Successfully installed jsonschema functools32 02:54:34 INFO - Cleaning up... 02:54:34 INFO - Return code: 0 02:54:34 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 02:54:34 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:54:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:34 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:54:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:54:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:54:34 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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e6baa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e6c14c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa0225b5af0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, '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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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 02:54:34 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', 'flake8'] in /builds/slave/test/build 02:54:34 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 flake8 02:54:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:54:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:54:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:54:34 INFO - 'HOME': '/Users/cltbld', 02:54:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:54:34 INFO - 'LOGNAME': 'cltbld', 02:54:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:54:34 INFO - 'MOZ_NO_REMOTE': '1', 02:54:34 INFO - 'NO_EM_RESTART': '1', 02:54:34 INFO - 'PAGER': '/bin/cat', 02:54:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:54:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:54:34 INFO - 'PWD': '/builds/slave/test', 02:54:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:54:34 INFO - 'SHELL': '/bin/bash', 02:54:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:54:34 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:54:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:54:34 INFO - 'USER': 'cltbld', 02:54:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:54:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:54:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:54:34 INFO - 'XPC_FLAGS': '0x0', 02:54:34 INFO - 'XPC_SERVICE_NAME': '0', 02:54:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:54:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:54:34 INFO - Downloading/unpacking flake8 02:54:34 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 02:54:34 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 02:54:34 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 02:54:34 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 02:54:34 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 02:54:34 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 02:54:37 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 02:54:37 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 02:54:37 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:37 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 02:54:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 02:54:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 02:54:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 02:54:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 02:54:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 02:54:38 INFO - no previously-included directories found matching 'docs/_build' 02:54:38 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 02:54:38 INFO - Running setup.py install for pep8 02:54:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 02:54:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 02:54:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 02:54:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 02:54:38 INFO - no previously-included directories found matching 'docs/_build' 02:54:38 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 02:54:38 INFO - Successfully installed flake8 mccabe pyflakes pep8 02:54:38 INFO - Cleaning up... 02:54:38 INFO - Return code: 0 02:54:38 INFO - Running post-action listener: _resource_record_post_action 02:54:38 INFO - Running post-action listener: _start_resource_monitoring 02:54:38 INFO - Starting resource monitoring. 02:54:38 INFO - ##### 02:54:38 INFO - ##### Running install step. 02:54:38 INFO - ##### 02:54:38 INFO - Running pre-action listener: _resource_record_pre_action 02:54:38 INFO - Running main action method: install 02:54:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:54:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:54:39 INFO - Reading from file tmpfile_stdout 02:54:39 INFO - Detecting whether we're running mozinstall >=1.0... 02:54:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:54:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:54:39 INFO - Reading from file tmpfile_stdout 02:54:39 INFO - Output received: 02:54:39 INFO - Usage: mozinstall [options] installer 02:54:39 INFO - Options: 02:54:39 INFO - -h, --help show this help message and exit 02:54:39 INFO - -d DEST, --destination=DEST 02:54:39 INFO - Directory to install application into. [default: 02:54:39 INFO - "/builds/slave/test"] 02:54:39 INFO - --app=APP Application being installed. [default: firefox] 02:54:39 INFO - mkdir: /builds/slave/test/build/application 02:54:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 02:54:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 02:55:10 INFO - Reading from file tmpfile_stdout 02:55:10 INFO - Output received: 02:55:10 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 02:55:10 INFO - Running post-action listener: _resource_record_post_action 02:55:10 INFO - ##### 02:55:10 INFO - ##### Running run-tests step. 02:55:10 INFO - ##### 02:55:10 INFO - Running pre-action listener: _resource_record_pre_action 02:55:10 INFO - Running main action method: run_tests 02:55:11 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 02:55:11 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 02:55:11 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 02:55:11 INFO - 2016-03-25 02:55:11.009 screenresolution[1655:8360] starting screenresolution argv=screenresolution get 02:55:11 INFO - 2016-03-25 02:55:11.012 screenresolution[1655:8360] Display 0: 1600x1200x32@60 02:55:11 INFO - 2016-03-25 02:55:11.018 screenresolution[1656:8362] starting screenresolution argv=screenresolution list 02:55:11 INFO - Available Modes on Display 0 02:55:11 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 02:55:11 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 02:55:11 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 02:55:11 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 02:55:11 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 02:55:11 INFO - Intel Iris: 02:55:11 INFO - Chipset Model: Intel Iris 02:55:11 INFO - Type: GPU 02:55:11 INFO - Bus: Built-In 02:55:11 INFO - VRAM (Dynamic, Max): 1536 MB 02:55:11 INFO - Vendor: Intel (0x8086) 02:55:11 INFO - Device ID: 0x0a2e 02:55:11 INFO - Revision ID: 0x0009 02:55:11 INFO - Displays: 02:55:11 INFO - Display: 02:55:11 INFO - Resolution: 1600 x 1200 @ 60 Hz 02:55:11 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 02:55:11 INFO - Display Serial Number: 1600x1200 60 02:55:11 INFO - Main Display: Yes 02:55:11 INFO - Mirror: Off 02:55:11 INFO - Online: Yes 02:55:11 INFO - Rotation: Supported 02:55:11 INFO - Return code: 0 02:55:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:55:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:55:11 INFO - Python 2.7.3 02:55:11 INFO - Return code: 0 02:55:11 INFO - grabbing minidump binary from tooltool 02:55:11 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:55:11 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e55ed30>, '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 0x10e3c2db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e555b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:55:11 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 02:55:11 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 02:55:11 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:55:11 INFO - Return code: 0 02:55:11 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 02:55:11 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:55:11 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:55:11 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 02:55:11 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:55:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 02:55:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 02:55:12 INFO - Return code: 0 02:55:12 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/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0109', '--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 02:55:12 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/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0109 --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 02:55:12 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.10XSqqe7Qk/Render', 02:55:12 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:55:12 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:55:12 INFO - 'HOME': '/Users/cltbld', 02:55:12 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:55:12 INFO - 'LOGNAME': 'cltbld', 02:55:12 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:55:12 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 02:55:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:55:12 INFO - 'MOZ_NO_REMOTE': '1', 02:55:12 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:55:12 INFO - 'NO_EM_RESTART': '1', 02:55:12 INFO - 'PAGER': '/bin/cat', 02:55:12 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:55:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:55:12 INFO - 'PWD': '/builds/slave/test', 02:55:12 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:55:12 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:55:12 INFO - 'SHELL': '/bin/bash', 02:55:12 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.hmYmSQyo7s/Listeners', 02:55:12 INFO - 'TMPDIR': '/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/', 02:55:12 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:55:12 INFO - 'USER': 'cltbld', 02:55:12 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:55:12 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:55:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:55:12 INFO - 'XPC_FLAGS': '0x0', 02:55:12 INFO - 'XPC_SERVICE_NAME': '0', 02:55:12 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:55:12 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/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0109', '--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 02:55:12 INFO - mozversion application_buildid: 20160325004031 02:55:12 INFO - mozversion application_changeset: a4481ccef67e4732e005b3538df8d8e61890bcdc 02:55:12 INFO - mozversion application_display_name: FirefoxDeveloperEdition 02:55:12 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:55:12 INFO - mozversion application_name: Firefox 02:55:12 INFO - mozversion application_remotingname: firefox-dev 02:55:12 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 02:55:12 INFO - mozversion application_vendor: Mozilla 02:55:12 INFO - mozversion application_version: 47.0a2 02:55:12 INFO - mozversion platform_buildid: 20160325004031 02:55:12 INFO - mozversion platform_changeset: a4481ccef67e4732e005b3538df8d8e61890bcdc 02:55:12 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 02:55:12 INFO - mozversion platform_version: 47.0a2 02:55:12 INFO - using testdate: 1458899712 02:55:12 INFO - actual date: 1458899712 02:55:12 INFO - starting webserver on 'localhost:49274' 02:55:12 INFO - SUITE-START | Running 2 tests 02:55:12 INFO - TEST-START | dromaeo_css 02:55:12 INFO - operating with platform_type : mac_ 02:55:12 INFO - Initialising browser for dromaeo_css test... 02:55:12 INFO - TEST-INFO | started process 1674 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/tmpkDZ9fe/profile http://localhost:49274/getInfo.html) 02:55:15 INFO - PROCESS | 1674 | __metrics Screen width/height:1600/1200 02:55:15 INFO - PROCESS | 1674 | colorDepth:24 02:55:15 INFO - PROCESS | 1674 | Browser inner width/height: 1024/689 02:55:15 INFO - PROCESS | 1674 | __metrics 02:55:15 ERROR - PROCESS | 1674 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 02:55:16 INFO - TEST-INFO | 1674: exit 0 02:55:16 INFO - Browser initialized. 02:55:16 INFO - Running cycle 1/1 for dromaeo_css test... 02:55:16 INFO - TEST-INFO | started process 1679 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/tmpkDZ9fe/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:55:28 INFO - PROCESS | 1679 | RSS: Main: 219996160 02:55:28 INFO - PROCESS | 1679 | 02:56:18 INFO - PROCESS | 1679 | 1458899778020 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] 02:58:29 INFO - PROCESS | 1679 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49274/tests/dromaeo/cssquery-ext.html) 02:58:30 INFO - PROCESS | 1679 | RSS: Main: 232988672 02:58:30 INFO - PROCESS | 1679 | 03:01:32 INFO - PROCESS | 1679 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-ext.html (next: http://localhost:49274/tests/dromaeo/cssquery-jquery.html) 03:01:32 INFO - PROCESS | 1679 | RSS: Main: 243126272 03:01:32 INFO - PROCESS | 1679 | 03:04:34 INFO - PROCESS | 1679 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49274/tests/dromaeo/cssquery-mootools.html) 03:04:35 INFO - PROCESS | 1679 | RSS: Main: 245141504 03:04:35 INFO - PROCESS | 1679 | 03:07:37 INFO - PROCESS | 1679 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49274/tests/dromaeo/cssquery-prototype.html) 03:07:37 INFO - PROCESS | 1679 | RSS: Main: 245452800 03:07:37 INFO - PROCESS | 1679 | 03:10:40 INFO - PROCESS | 1679 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49274/tests/dromaeo/cssquery-yui.html) 03:10:40 INFO - PROCESS | 1679 | RSS: Main: 248274944 03:10:40 INFO - PROCESS | 1679 | 03:13:42 INFO - PROCESS | 1679 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-yui.html (next: http://localhost:49274/tests/dromaeo/cssquery-dojo.html) 03:13:43 INFO - PROCESS | 1679 | RSS: Main: 251318272 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - PROCESS | 1679 | __start_tp_report 03:13:43 INFO - PROCESS | 1679 | _x_x_mozilla_page_load 03:13:43 INFO - PROCESS | 1679 | _x_x_mozilla_page_load_details 03:13:43 INFO - PROCESS | 1679 | |i|pagename|runs| 03:13:43 INFO - PROCESS | 1679 | |0;dojo.html;3485.1287178205444;3532.1522834519706;3560.4125319322297;3590.084528445246;3636.599974002859;4727.55088266615;5545.835374571335;5852.385499522553;5886.352501224862;5899.321578018529;5802.970985145079;5816.447437493432;5832.708364581765;5838.2994040715175;5852.707364631762;5276.261323414725;5318.92021619677;5337.813176538822;5341.439148889369;5363.919541206885;5178.974105129469;5306.416294207634;5315.521603055724;5381.838544843661;5389.595780316472;5242.239875218091;5292.497212764782;5295.443978382272;5297.231901374298;5404.081306177959;5355.464453554633;5360.812371566996;5388.811391601314;5419.891602167934;5470.9452905470835;5067.847964561069;5169.431362550116;5281.445448227958;5313.38896026958;5314.309139811839;5658.603897727161;5678.772849086032;5680;5697.31632204134;5717.656940583578;6179.50563954887;6289.87420251597;6295.559310848243;6301.590396624205;6303.36966303366;5360.249565060894;6196.163517925068;6216.937830621681;6293.590916590407;6294.968525157391;5943.554233432466;5972.581919265696;5974.283086029661;5974.701264936736;5982.371850955674;6389.456896163878;6394.360563943662;6399.360063993657;6417.711202995876;6440.645764482904;6104.114903338991;6150.907736383958;6232.3144454110015;6293.653849038255;6318.684065796691;6272.466840318624;6295.213098362705;6328.71520781566;6336.144620476269;6349.809505714836;6119.746288422617;6170.444659980623;6288.717007734663;6308.148399966038;6310.085037669604;6201.534884883652;6239.438450539473;6257.7184026718;6273.529485288622;6277.8744425111245;4978.879752055758;5025.095482813055;5039.7228152451235;5040.697558146523;5054.646174767731;4344.869653910388;4350.71720338177;4512.796924138422;4519.389882365838;4529.5243999380245;5761.942380576141;5919.822405327847;5969.343372229051;6003.489703375175;6052.57631965767;6262.780802671976;6264.060390941395;6270.749170033238;6285.8742825143245;6301.8109456716375;5771.509421699203;5780.682062486603;5994.820155395345;6039.184710064173;6053.061775424816;5475.479829416199;5497.780088796403;5499.230107784913;5535.944640553624;5552.7778888844805;6459.224893012774;6500.5449618526245;6516.73933042673;6517.446017088506;6519.576227545289;6204.627722336674;6236.220472440945;6250.156228909039;6271.717772700148;6308.936910630835;6465.22417309907;6467.611943283418;6494.220693516808;6494.805155845333;6502.057201705632;6232.314445411092;6279.089532017741;6282.371762823681;6293;6299.622022678654;5279.812042290608;6135.355787642412;6173.166622505904;6300.243970723543;6313.842153946188;6190.102435146789;6234.314225435289;6242.282137554058;6254.437100660963;6280.685965701788;6218.471429928507;6246.625202487683;6247.5939063960695;6255.155554000152;6260.812175634738;5816.41835816415;6066.696665166813;6115.938840611715;6139.109829074849;6158.230221222348;6106.603070800384;6143.627233423056;6203.31763506023;6210.975189093749;6242.625442473466;5918.053111502139;6136.969315153396;6137.294211165595;6143.72353244114;6148.877022459436 03:13:43 INFO - PROCESS | 1679 | |1;ext.html;487.5441462232815;536.9033573956688;548.5721137512742;553.4603761332704;561.7585136847566;32152.839235803818;38710.225795484075;38838.417423738596;38841;38918;42306.7307980761;42884.71345859621;43114;43229.35155972663;43257.567424325825;8585.613647385882;9570.952145239264;9854.90145098547;9893.25800564957;9904.653337133203;9678.322517423783;9750.512474376288;9789.363691360075;9796.118349348557;9801.803963920718;9767.951160244189;9815.263855210853;9817.607295708163;9827.606895724162;9902.207823374112;9730.756731081708;9743.415395076318;9775.364601300893;9816.018398160199;9818.6072557098;8200.343972482187;9699.806003879883;9709.6601618943;9721.90278097217;9725.805483890354;39715.20569588621;39875.800620997;40009.599904000876;40202.59797402018;40284;2921.6494020717437;3270.885519006847;3276.7870088444415;3329.6004479462617;3481.3037392521596;28277.57583636247;29881.551776723365;30052.098437046923;30224.697753022407;31552.368952621047;2792.399634078683;2836.078274560776;2844.1751891951308;2867.1541895140986;2914.7231013053724;471291;472460;476885;479077.60461197817;480524;47154.5284547157;72558.27441725621;72811.63594181996;72836.90744638834;72908.90636640455;47092;47243;47359;47548.7622561885;47588;13727.382267797973;16920.746188807178;17166.742498862528;17196.31214751396;17734;13134.277614731282;13288.667783305302;13300.800487992688;13347.93326033383;13389.933050334686;15253.313600887986;15310.693786124215;15433.768493472608;15479.226038698245;15527.534173974798;6514.967425162844;6675.365840245266;6806.76176333826;6856.657167141722;6860.348266914635;1010.6765834932897;1031.6028329093353;1089.8910108989037;1117.6311817100338;1158.7972104881612;30109.849450752605;30342.84828575843;30562.84718576393;30795.230119247197;30910.381792364027;1127.3517727306833;1134.89785919266;1167.5154810753443;1194.062660811259;1210.431097384228;15159.711424528818;15359.61600959985;15383.307751151226;15532.767008494882;15875.603109922344;540640;551146;551166;554533;557404;57212.71393643088;61390.77218455606;61581.692091539255;62147.37852621416;62398.68800655968;1524.329295110148;1531.4410240262446;1544.2124516496892;1554.8289688134296;1556.9688606227812;29850;30154;30218.79124834982;30495.542566861957;30992.380152397276;52536.94926101533;52634.473655262955;52698.736506317226;52993.41019769413;52999.47000529945;512971;513475;515650;515913;519112;33731.662683373834;34090.63637454474;34820.477692835135;35272;35500.467492988144;47020;47259.76370118128;47338.52661473341;47531.52468475271;47829;32167;38182.427263590514;38325.61674383221;38640.42039369468;39700.00749981274;37167.814160929025;37977.43033854439;38089.6191038086;38285.042873928374;38286.80856595699;27527;29980.700192997792;38272;38482;39112.022199445244;26592;30925.536116957814;31795.84102079475;32559.674403256613;32633.836830815693;24937.501249975263;25498;25781.484370312864;25902.740972590032;25926.870365648807 03:13:43 INFO - PROCESS | 1679 | |2;jquery.html;384.21236465246255;390.5294120584696;390.9257833323463;394.0778578127182;400.19161294185744;15614.890733357737;16467.01197928125;20150.39548813536;20774.9612519374;20791.584168316625;20127.59744805103;20315.39053828384;20401.877896715712;20511.692324615105;21017.789822101775;5733.226014488053;5753.5684823638185;5917.644941303535;5978.9701051494685;5992.43071908168;5809.883802323951;5811.651300921937;5904.616199947011;5909.349971503131;5920.171176035358;5664.26364572605;5839.065749480084;5901.439363260483;5904.970475147618;5955.523558115362;5818.650880947114;5837.182794408786;5898.498627616657;5916.940830591682;5917.142014407908;4861.270809378586;5070.29015937769;5121.718305493197;5168.586513078944;5175.870603234912;25277.24168274936;25480.235592932055;25587.02276393616;25819;25936.351591210183;2137.850350475467;2277.259890535566;2293.988530057339;2313.4332088638225;2368.230325144335;14661.34023968924;14772.704545909022;14960.102393856294;15022.624434389118;15274.847251527453;1742.8692848036321;1826.9634607307912;1876.962460750791;1878.2205384765443;1972.3491247888162;80927.19072809255;104151;108017.99999999921;108049;109235.45382273117;9063.773405664779;11141;11228.719282017852;11239.60661376848;11258.930401611833;13263.071584989151;13373.264470454023;13400.865991340157;13452.730945381234;13481.730365392637;9045.819083618422;9155.81688366229;9156.725298241063;9176;9263.305252106118;9497.477638729799;9535.52322383878;9535.952320238355;9546.809063818684;9609.47147906858;6455.677216139175;6564.507661925375;6568.7372505099265;6576.408123268929;6594.406503414716;1952.2971730177126;1983.2860170338668;1990.3232900813794;2003.4991252186953;2003.6393449178995;957.2772556719632;1078.5577913055765;1081.567373050786;1101.730076131353;1123.8482804821244;20555.691664625043;21311.68032479514;21745.891270543547;21802.127914883546;21883.890580547315;903.7605034665819;1008.470552959702;1048.9895101049044;1051.0277992856577;1108.6895669212633;11613.941930290464;11685.006774424099;11931.642050738317;11951.22317049389;11955.043596512432;618566;643271;654219;655006;665905;60172.69913650404;70238.64880675563;98844.03467895975;112501.31248031123;114411.42794285975;913.456493386434;1039.3192458939407;1062.4103622489592;1070.240129508058;1072.544168728303;18725.90637046806;19019.809801901803;19191.52021199481;19413.417597471533;19501.609967800847;49743.756406090135;50696.23955640595;51870.96258074893;52287.73856130695;53882;70341;72003.63998179976;72069;73386;74419.62790186015;7944.44388892772;8027.438079334391;8077.474964127313;8144.592770361577;8165.918340816754;12099.637010889688;12455.252684838939;12754.553590624284;13666.590002299947;13807.102538334975;11095.611653592085;11671.36600875861;11757;11903.047756179658;11933.045356371644;9238.630454782002;11610.24533405326;11623.6512904613;11734.589289374831;11875.40654746255;9225.49259790718;10956.726081847699;11559.884401155881;12126.090543209471;12175.573854915036;7953.6818527258265;8018.3585313173635;8183.304419124441;8188.303994160563;8228.958855205685;11797;11908.52365905354;11945.641630751092;12044.698882528008;12136.271823690608 03:13:43 INFO - PROCESS | 1679 | |3;mootools.html;1269.3209133113783;1619.849906566338;1750.921208545616;1842.4104286628276;2054.465838881892;8023;8806.163414475623;8869.201771840533;8989.50557719326;8991.280697544196;8894.066123057082;8912.777180570489;8986.37095403322;8994.68518601849;9006.09939006099;2502.4244423782543;2523.6088406297054;2523.6466894634764;2527.9620805687928;2538.23852844146;2471.159805666073;2526.6462695222685;2531.3038914298622;2539.4032402385424;2552.1067626330823;2507.69907611086;2522.255934499327;2530.101813856082;2555.591105423133;2557.8593177375237;2512.623106534007;2524.432002799374;2532.050481069599;2534.746525347469;2538.225841118458;2499.9250022499355;2527.5829488134436;2529.53203657324;2531.1394125997067;2548.019012680113;9135.77160570991;9165.358424910259;9175.311851611155;9178.128077832594;9209;4613.677042607019;4722.551357621055;5663.433656634304;5704.71476426177;5725.312962444534;3549.3078849624335;3598.1364472526666;3614.4397618369194;3657.3233951718753;3657.7073834093476;902.3773596218588;914.1863741270275;927.679950417105;932.5104320231865;975.3806332978538;12131.21147125434;12231.204971676902;12288.569900053544;12300.938495307555;12301.753964920741;4344.196323680129;4838.153323168432;4954;5061.544460998454;5062.088824011639;10347;10360.689179324632;10366.222533310032;10412.5834966602;10448.111910487542;5520.06158952971;5622;5628.831135065954;5632.943670563324;5645.4072322405555;4508.752018638941;4851.733154676456;4952.083864485082;5052.368453943257;5058.924116138261;3591.94612080819;4066.7620978965106;4125.793710314472;4129.834806607702;4174.478190226222;1341.336038660869;1347.730453909222;1357.4841560207255;1360.183889666212;1366.9658258543616;1374.9725005500034;1380.3926272440094;1387.7432674955166;1409.598264494614;1413.2227274998709;8340.207680270365;8499.532525711145;8563.871541926752;8587.184217499327;8588.52763098023;453.5849697526792;522.2036394498421;525.9684418934876;531.7660229499008;540.108820446259;6193.225846769154;6241.750329986749;6303.9684801575695;6317.6209427434505;6367.872642547123;9470.810583788285;10723.83914241287;11043.226974111896;11047.005769480786;11112.555497779998;10576.153907687367;10733.892661073445;10944.726381840359;10977.670669879917;11019.614313499149;8467.237948584658;8564.229219370287;8565.571721413904;8591.968963724394;8619.525926074;7950.64222110018;7996.800079997814;8054.959725201336;8064.112947575644;8175.591220439073;9682.903170968482;9902.405855648396;9905.999999999713;9918.454485003105;9923.851142232728;9968.900310997087;10181.33821301613;10219.131373833308;10323.380597164194;10360.53377598025;7299.6350182489605;7491.288327608869;7499.987501687202;7542.170361260367;7580.54516728998;8440.53577053268;8450.788730281793;8463.069062403254;8486.448380855225;8545.572721363782;7317;7527.887081693889;7560.319571238615;7570.886436703344;7642.847143057219;7212.206657267801;7258.346748792634;7289.979402883495;7364.226756190523;7385.630718464163;7950.284474397332;7968.681252749825;7982.121966583787;8004.479708818908;8024.277814996678;7182.0663313770965;7187.5687458752645;7189.065421495172;7232.710691572489;7258.0927384076995;7264.982902393564;7327.780166595011;7331.266873312626;7366.96316518414;7375.557466552024 03:13:43 INFO - PROCESS | 1679 | |4;prototype.html;300.1730233207513;337.73994024601075;342.9434143366345;344.63468723153443;345.7009686621073;6912.792616221509;6917.230109590273;6947.166340039196;6950.165980082397;6992.580445173293;6883.896741548869;6907.378335949764;6916.827079323007;6925.930740692592;6930.5148639595245;4869.683470574419;4925.285833554132;5071.670341427814;5082.907174957383;5154.201098829678;5049.545540901318;5077.390713114413;5093.26147708582;5106.106431374495;5117.33474648297;5004.324416203803;5013.573846223057;5015.846355338274;5038.5969122470115;5042.747862606873;5018.974905125469;5032.798688052473;5037.14368557348;5050.217216331474;5057.822976195852;3774.1885494618514;4249.596288352602;4358.607725304738;4363.192809330284;4367.344898265285;6330.556861019731;6684.966575167093;6692.83267918306;6717.596944183316;6725.596464212163;5952.136940143699;5995.700214989233;5999.820005399845;6016.097585362187;6017.217761690952;7479.700811967515;7494.288042635941;7502.5873576953245;7568.318851303354;7591.658375373121;4788.162071637449;4793.3049707792525;4803.759812009421;4809.110314591777;4820.204666230068;6362.840928976766;7673.271039251206;7834.764957051298;7929.28636422719;7932.563708996003;4812.085703716282;4865;4879.731614761151;4881.194602890554;4885.900672348693;4927.876803079952;4953.975230123826;4968.30443737877;4986.975065124651;4991.725455100004;5980.671063091485;5989.101634754822;5990.6705131218205;5993.610415323077;6002.429769171922;7522.548647081193;7531.020967274219;7534.54792712439;7560.659770310349;7576.772696819105;1697.0835748695565;1721.8794684372224;1725.7660772547688;1726.3181043487753;1728.1445684386308;1054.056619325699;1091.5306418240075;1096.9396683182501;1097.3964319624174;1100.6037826382496;6822.249552549216;6937.653117344113;6970.651467426608;6987.825304367431;7010.789676309617;7389.8152546186775;7707.421943354158;7719.729809456754;7741.496802707806;7782.299593036654;6822.863542729117;7069.71721131149;7080.398166155832;7086.7519636813495;7103.112110986127;4091.57038510958;4140.710150289511;4141.358089496133;4142.275101857163;4143.150654115899;8198.877016844752;8231.382646301552;8233.917660823436;8243.175682431709;8245.711400100967;7794;8072.919270807217;8076.515409075474;8107.675692972333;8128.634211460499;8149.225823546753;8197.05733840604;8201.056878458934;8202.917970820215;8244.216799404046;6319.842003949938;7801.2198780121535;7806.765797026098;7811.062672479339;7829;6757.3580509853455;7664.923350766644;7679.923200767921;7682.577458239851;7723.227677232232;6574.3754343337305;7909.5254284740795;8166.7958301042945;8190.918090819254;8200.343972482306;4119.505659320901;4758.191107511662;4849.781759820746;4869.805207791649;4872.123017856819;7775.339096176888;7779.533228006338;7780;7780.2219778021745;7800.1419843816;7253.3834624057545;7485.326320631169;7491.325780679765;7496.550206987598;7508.887366689613;7449;7475.663595138123;7477.027986361738;7483.663235154322;7509.812254693457;7295.7081716732855;7296;7313.378362839218;7321.853562928818;7329.52358096722;7459.216782237787;7479.102507699111;7487.5507469552;7489.850202995801;7506.474546781673;7023.192332881784;7323.084614423197;7341.972123902551;7363.668634911549;7367.44744144202 03:13:43 INFO - PROCESS | 1679 | |5;yui.html;757.3794670440276;757.5076200469695;781.3475747750628;783.2637320918336;794.7734895554764;13728.244946527937;13862.792058119136;13938;13939.651508712263;13963.860361396395;13567.525136620221;13613.319334033284;13633.727325453485;13633.795493067611;13639;778.2178910195246;957.4016239850093;968.9563969621383;981.8576306435563;992.7270000749816;833.7790485521342;973.0221127766584;978.8580655804903;999.8050380175832;1000.1099021870505;1001.219049141667;1010.5957616953204;1042.7549525861416;1044.5456226541442;1051.568856768725;989.0406305883282;1027.6146445083018;1033.225081189108;1036.7045392063264;1042.2027149230844;767.6353731977322;769.1308821032197;774.6243072110022;774.8760198368234;776.9937930380171;15444.922775386163;15528.689426211526;15574.610634734108;15581.298841552158;15608.29762660683;12953.611391658265;12961.287129207889;13093.297821593285;13124.737505249937;13147.342632868318;8600.612972416257;9980.600775968953;10100.646477373257;10262.281640285182;10595.364278143259;3465.878694245689;3504.229069604683;3542.4509201073615;3597.478365636994;3759.6992240620957;56270.71864640692;81889.59055204745;83075;83224.58387708083;83625;9577.473238971923;9703.466309353053;9764.755881103029;10318.948405257926;10455.790884182274;21338.78661213399;21338.893305533373;21534.13863445476;21585.784142158693;21640.350789476026;7403.666834992438;7572.280633339824;7613.390928725688;7721.691132354756;7724.459287849909;3968.151410025766;4117.505899292104;4125.154343359604;4131.5455299916985;4196.580341965779;2725.3867879726904;3041.361314124059;3196.456602377555;3619.7828130312264;3638.3632864248652;672.5460314287934;681.1145510835894;688.1295161620554;690.102866273842;691.5885048396196;469.5679974423538;522.8300802239287;546.4371697151939;582.6940856050522;584.6608966799331;7868.370530357558;8288.129746376544;8346.457480263764;8423.284020858173;8598.613062412207;600.7236671131241;601.8826328865916;614.9692515374303;619.9442050215412;626.6428135962549;3104.98447507761;3711.662820982551;3794.032521706947;3824;3874.341361968472;99508.50245748869;100517.49741251247;101108.49445752871;101662.49168754257;101928;83053.58473207595;83631.3273734534;84703;85645;86624.56687716521;60589.09116363258;74494;74962;78353.60823195962;80552;8419.200175983271;8618.913810861812;8640.870386944327;8643.394962352575;8752.649894004424;47015;49608.255876162606;52955;53023.20465192948;53250.46749532455;66001.019969401;69672;73249;74728;76550;10760.46197690128;10781.784364312512;10850.348979061282;11019.889801101886;11297.43512824372;11939.701507462383;11971.521139154336;11988.100892432927;11998.64004079879;12461.127721059438;11493.655190344303;11497;11501.884981150082;11666.358350290815;12315.630531084082;11044.226904116635;11487.942560287145;11549.422528873354;11641.825372619249;12317.44571494267;10352.430616316175;11318.434078296217;11321.320720756781;11352.659420217407;11559.479823407799;9516.809663806824;9521.238300936047;9659;9965.35225210359;10021.248406369406;9475.576210762467;9645.180159686224;9669.419834809934;9691.07934746198;9753.512324383895 03:13:43 INFO - PROCESS | 1679 | __end_tp_report 03:13:43 INFO - PROCESS | 1679 | __start_cc_report 03:13:43 INFO - PROCESS | 1679 | _x_x_mozilla_cycle_collect,359 03:13:43 INFO - PROCESS | 1679 | __end_cc_report 03:13:43 INFO - PROCESS | 1679 | __startTimestamp1458900823154__endTimestamp 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - PROCESS | 1679 | ------- Summary: start ------- 03:13:43 INFO - PROCESS | 1679 | Number of tests: 6 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - PROCESS | 1679 | [#0] dojo.html Cycles:165 Average:5833.53 Median:6115.94 stddev:635.72 (10.4%) stddev-sans-first:610.39 03:13:43 INFO - PROCESS | 1679 | Values: 3485.1 3532.2 3560.4 3590.1 3636.6 4727.6 5545.8 5852.4 5886.4 5899.3 5803.0 5816.4 5832.7 5838.3 5852.7 5276.3 5318.9 5337.8 5341.4 5363.9 5179.0 5306.4 5315.5 5381.8 5389.6 5242.2 5292.5 5295.4 5297.2 5404.1 5355.5 5360.8 5388.8 5419.9 5470.9 5067.8 5169.4 5281.4 5313.4 5314.3 5658.6 5678.8 5680.0 5697.3 5717.7 6179.5 6289.9 6295.6 6301.6 6303.4 5360.2 6196.2 6216.9 6293.6 6295.0 5943.6 5972.6 5974.3 5974.7 5982.4 6389.5 6394.4 6399.4 6417.7 6440.6 6104.1 6150.9 6232.3 6293.7 6318.7 6272.5 6295.2 6328.7 6336.1 6349.8 6119.7 6170.4 6288.7 6308.1 6310.1 6201.5 6239.4 6257.7 6273.5 6277.9 4978.9 5025.1 5039.7 5040.7 5054.6 4344.9 4350.7 4512.8 4519.4 4529.5 5761.9 5919.8 5969.3 6003.5 6052.6 6262.8 6264.1 6270.7 6285.9 6301.8 5771.5 5780.7 5994.8 6039.2 6053.1 5475.5 5497.8 5499.2 5535.9 5552.8 6459.2 6500.5 6516.7 6517.4 6519.6 6204.6 6236.2 6250.2 6271.7 6308.9 6465.2 6467.6 6494.2 6494.8 6502.1 6232.3 6279.1 6282.4 6293.0 6299.6 5279.8 6135.4 6173.2 6300.2 6313.8 6190.1 6234.3 6242.3 6254.4 6280.7 6218.5 6246.6 6247.6 6255.2 6260.8 5816.4 6066.7 6115.9 6139.1 6158.2 6106.6 6143.6 6203.3 6211.0 6242.6 5918.1 6137.0 6137.3 6143.7 6148.9 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - PROCESS | 1679 | [#1] ext.html Cycles:180 Average:65483.10 Median:38839.71 stddev:137128.35 (353.1%) stddev-sans-first:137426.21 03:13:43 INFO - PROCESS | 1679 | Values: 487.5 536.9 548.6 553.5 561.8 32152.8 38710.2 38838.4 38841.0 38918.0 42306.7 42884.7 43114.0 43229.4 43257.6 8585.6 9571.0 9854.9 9893.3 9904.7 9678.3 9750.5 9789.4 9796.1 9801.8 9768.0 9815.3 9817.6 9827.6 9902.2 9730.8 9743.4 9775.4 9816.0 9818.6 8200.3 9699.8 9709.7 9721.9 9725.8 39715.2 39875.8 40009.6 40202.6 40284.0 2921.6 3270.9 3276.8 3329.6 3481.3 28277.6 29881.6 30052.1 30224.7 31552.4 2792.4 2836.1 2844.2 2867.2 2914.7 471291.0 472460.0 476885.0 479077.6 480524.0 47154.5 72558.3 72811.6 72836.9 72908.9 47092.0 47243.0 47359.0 47548.8 47588.0 13727.4 16920.7 17166.7 17196.3 17734.0 13134.3 13288.7 13300.8 13347.9 13389.9 15253.3 15310.7 15433.8 15479.2 15527.5 6515.0 6675.4 6806.8 6856.7 6860.3 1010.7 1031.6 1089.9 1117.6 1158.8 30109.8 30342.8 30562.8 30795.2 30910.4 1127.4 1134.9 1167.5 1194.1 1210.4 15159.7 15359.6 15383.3 15532.8 15875.6 540640.0 551146.0 551166.0 554533.0 557404.0 57212.7 61390.8 61581.7 62147.4 62398.7 1524.3 1531.4 1544.2 1554.8 1557.0 29850.0 30154.0 30218.8 30495.5 30992.4 52536.9 52634.5 52698.7 52993.4 52999.5 512971.0 513475.0 515650.0 515913.0 519112.0 33731.7 34090.6 34820.5 35272.0 35500.5 47020.0 47259.8 47338.5 47531.5 47829.0 32167.0 38182.4 38325.6 38640.4 39700.0 37167.8 37977.4 38089.6 38285.0 38286.8 27527.0 29980.7 38272.0 38482.0 39112.0 26592.0 30925.5 31795.8 32559.7 32633.8 24937.5 25498.0 25781.5 25902.7 25926.9 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - PROCESS | 1679 | [#2] jquery.html Cycles:180 Average:34998.20 Median:12080.58 stddev:106585.61 (882.3%) stddev-sans-first:106852.92 03:13:43 INFO - PROCESS | 1679 | Values: 384.2 390.5 390.9 394.1 400.2 15614.9 16467.0 20150.4 20775.0 20791.6 20127.6 20315.4 20401.9 20511.7 21017.8 5733.2 5753.6 5917.6 5979.0 5992.4 5809.9 5811.7 5904.6 5909.3 5920.2 5664.3 5839.1 5901.4 5905.0 5955.5 5818.7 5837.2 5898.5 5916.9 5917.1 4861.3 5070.3 5121.7 5168.6 5175.9 25277.2 25480.2 25587.0 25819.0 25936.4 2137.9 2277.3 2294.0 2313.4 2368.2 14661.3 14772.7 14960.1 15022.6 15274.8 1742.9 1827.0 1877.0 1878.2 1972.3 80927.2 104151.0 108018.0 108049.0 109235.5 9063.8 11141.0 11228.7 11239.6 11258.9 13263.1 13373.3 13400.9 13452.7 13481.7 9045.8 9155.8 9156.7 9176.0 9263.3 9497.5 9535.5 9536.0 9546.8 9609.5 6455.7 6564.5 6568.7 6576.4 6594.4 1952.3 1983.3 1990.3 2003.5 2003.6 957.3 1078.6 1081.6 1101.7 1123.8 20555.7 21311.7 21745.9 21802.1 21883.9 903.8 1008.5 1049.0 1051.0 1108.7 11613.9 11685.0 11931.6 11951.2 11955.0 618566.0 643271.0 654219.0 655006.0 665905.0 60172.7 70238.6 98844.0 112501.3 114411.4 913.5 1039.3 1062.4 1070.2 1072.5 18725.9 19019.8 19191.5 19413.4 19501.6 49743.8 50696.2 51871.0 52287.7 53882.0 70341.0 72003.6 72069.0 73386.0 74419.6 7944.4 8027.4 8077.5 8144.6 8165.9 12099.6 12455.3 12754.6 13666.6 13807.1 11095.6 11671.4 11757.0 11903.0 11933.0 9238.6 11610.2 11623.7 11734.6 11875.4 9225.5 10956.7 11559.9 12126.1 12175.6 7953.7 8018.4 8183.3 8188.3 8229.0 11797.0 11908.5 11945.6 12044.7 12136.3 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - PROCESS | 1679 | [#3] mootools.html Cycles:180 Average:6184.50 Median:5571.03 stddev:3298.37 (59.2%) stddev-sans-first:3286.92 03:13:43 INFO - PROCESS | 1679 | Values: 1269.3 1619.8 1750.9 1842.4 2054.5 8023.0 8806.2 8869.2 8989.5 8991.3 8894.1 8912.8 8986.4 8994.7 9006.1 2502.4 2523.6 2523.6 2528.0 2538.2 2471.2 2526.6 2531.3 2539.4 2552.1 2507.7 2522.3 2530.1 2555.6 2557.9 2512.6 2524.4 2532.1 2534.7 2538.2 2499.9 2527.6 2529.5 2531.1 2548.0 9135.8 9165.4 9175.3 9178.1 9209.0 4613.7 4722.6 5663.4 5704.7 5725.3 3549.3 3598.1 3614.4 3657.3 3657.7 902.4 914.2 927.7 932.5 975.4 12131.2 12231.2 12288.6 12300.9 12301.8 4344.2 4838.2 4954.0 5061.5 5062.1 10347.0 10360.7 10366.2 10412.6 10448.1 5520.1 5622.0 5628.8 5632.9 5645.4 4508.8 4851.7 4952.1 5052.4 5058.9 3591.9 4066.8 4125.8 4129.8 4174.5 1341.3 1347.7 1357.5 1360.2 1367.0 1375.0 1380.4 1387.7 1409.6 1413.2 8340.2 8499.5 8563.9 8587.2 8588.5 453.6 522.2 526.0 531.8 540.1 6193.2 6241.8 6304.0 6317.6 6367.9 9470.8 10723.8 11043.2 11047.0 11112.6 10576.2 10733.9 10944.7 10977.7 11019.6 8467.2 8564.2 8565.6 8592.0 8619.5 7950.6 7996.8 8055.0 8064.1 8175.6 9682.9 9902.4 9906.0 9918.5 9923.9 9968.9 10181.3 10219.1 10323.4 10360.5 7299.6 7491.3 7500.0 7542.2 7580.5 8440.5 8450.8 8463.1 8486.4 8545.6 7317.0 7527.9 7560.3 7570.9 7642.8 7212.2 7258.3 7290.0 7364.2 7385.6 7950.3 7968.7 7982.1 8004.5 8024.3 7182.1 7187.6 7189.1 7232.7 7258.1 7265.0 7327.8 7331.3 7367.0 7375.6 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - PROCESS | 1679 | [#4] prototype.html Cycles:180 Average:6105.94 Median:6921.58 stddev:1979.23 (28.6%) stddev-sans-first:1936.22 03:13:43 INFO - PROCESS | 1679 | Values: 300.2 337.7 342.9 344.6 345.7 6912.8 6917.2 6947.2 6950.2 6992.6 6883.9 6907.4 6916.8 6925.9 6930.5 4869.7 4925.3 5071.7 5082.9 5154.2 5049.5 5077.4 5093.3 5106.1 5117.3 5004.3 5013.6 5015.8 5038.6 5042.7 5019.0 5032.8 5037.1 5050.2 5057.8 3774.2 4249.6 4358.6 4363.2 4367.3 6330.6 6685.0 6692.8 6717.6 6725.6 5952.1 5995.7 5999.8 6016.1 6017.2 7479.7 7494.3 7502.6 7568.3 7591.7 4788.2 4793.3 4803.8 4809.1 4820.2 6362.8 7673.3 7834.8 7929.3 7932.6 4812.1 4865.0 4879.7 4881.2 4885.9 4927.9 4954.0 4968.3 4987.0 4991.7 5980.7 5989.1 5990.7 5993.6 6002.4 7522.5 7531.0 7534.5 7560.7 7576.8 1697.1 1721.9 1725.8 1726.3 1728.1 1054.1 1091.5 1096.9 1097.4 1100.6 6822.2 6937.7 6970.7 6987.8 7010.8 7389.8 7707.4 7719.7 7741.5 7782.3 6822.9 7069.7 7080.4 7086.8 7103.1 4091.6 4140.7 4141.4 4142.3 4143.2 8198.9 8231.4 8233.9 8243.2 8245.7 7794.0 8072.9 8076.5 8107.7 8128.6 8149.2 8197.1 8201.1 8202.9 8244.2 6319.8 7801.2 7806.8 7811.1 7829.0 6757.4 7664.9 7679.9 7682.6 7723.2 6574.4 7909.5 8166.8 8190.9 8200.3 4119.5 4758.2 4849.8 4869.8 4872.1 7775.3 7779.5 7780.0 7780.2 7800.1 7253.4 7485.3 7491.3 7496.6 7508.9 7449.0 7475.7 7477.0 7483.7 7509.8 7295.7 7296.0 7313.4 7321.9 7329.5 7459.2 7479.1 7487.6 7489.9 7506.5 7023.2 7323.1 7342.0 7363.7 7367.4 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - PROCESS | 1679 | [#5] yui.html Cycles:180 Average:18919.24 Median:23742.28 stddev:27211.45 (114.6%) stddev-sans-first:27253.62 03:13:43 INFO - PROCESS | 1679 | Values: 757.4 757.5 781.3 783.3 794.8 13728.2 13862.8 13938.0 13939.7 13963.9 13567.5 13613.3 13633.7 13633.8 13639.0 778.2 957.4 969.0 981.9 992.7 833.8 973.0 978.9 999.8 1000.1 1001.2 1010.6 1042.8 1044.5 1051.6 989.0 1027.6 1033.2 1036.7 1042.2 767.6 769.1 774.6 774.9 777.0 15444.9 15528.7 15574.6 15581.3 15608.3 12953.6 12961.3 13093.3 13124.7 13147.3 8600.6 9980.6 10100.6 10262.3 10595.4 3465.9 3504.2 3542.5 3597.5 3759.7 56270.7 81889.6 83075.0 83224.6 83625.0 9577.5 9703.5 9764.8 10318.9 10455.8 21338.8 21338.9 21534.1 21585.8 21640.4 7403.7 7572.3 7613.4 7721.7 7724.5 3968.2 4117.5 4125.2 4131.5 4196.6 2725.4 3041.4 3196.5 3619.8 3638.4 672.5 681.1 688.1 690.1 691.6 469.6 522.8 546.4 582.7 584.7 7868.4 8288.1 8346.5 8423.3 8598.6 600.7 601.9 615.0 619.9 626.6 3105.0 3711.7 3794.0 3824.0 3874.3 99508.5 100517.5 101108.5 101662.5 101928.0 83053.6 83631.3 84703.0 85645.0 86624.6 60589.1 74494.0 74962.0 78353.6 80552.0 8419.2 8618.9 8640.9 8643.4 8752.6 47015.0 49608.3 52955.0 53023.2 53250.5 66001.0 69672.0 73249.0 74728.0 76550.0 10760.5 10781.8 10850.3 11019.9 11297.4 11939.7 11971.5 11988.1 11998.6 12461.1 11493.7 11497.0 11501.9 11666.4 12315.6 11044.2 11487.9 11549.4 11641.8 12317.4 10352.4 11318.4 11321.3 11352.7 11559.5 9516.8 9521.2 9659.0 9965.4 10021.2 9475.6 9645.2 9669.4 9691.1 9753.5 03:13:43 INFO - PROCESS | 1679 | -------- Summary: end -------- 03:13:43 INFO - PROCESS | 1679 | 03:13:43 INFO - TEST-INFO | 1679: exit 0 03:13:43 INFO - TEST-OK | dromaeo_css | took 1110969ms 03:13:43 INFO - TEST-START | kraken 03:13:43 INFO - operating with platform_type : mac_ 03:13:43 INFO - Initialising browser for kraken test... 03:13:43 INFO - TEST-INFO | started process 1687 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/tmpUT0L3T/profile http://localhost:49274/getInfo.html) 03:13:46 INFO - PROCESS | 1687 | __metrics Screen width/height:1600/1200 03:13:46 INFO - PROCESS | 1687 | colorDepth:24 03:13:46 INFO - PROCESS | 1687 | Browser inner width/height: 1024/689 03:13:46 INFO - PROCESS | 1687 | __metrics 03:13:46 ERROR - PROCESS | 1687 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 03:13:47 INFO - TEST-INFO | 1687: exit 0 03:13:47 INFO - Browser initialized. 03:13:47 INFO - Running cycle 1/1 for kraken test... 03:13:47 INFO - TEST-INFO | started process 1691 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/T/tmpUT0L3T/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:13:59 INFO - PROCESS | 1691 | RSS: Main: 219742208 03:13:59 INFO - PROCESS | 1691 | 03:14:02 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-beat-detection) 03:14:02 INFO - PROCESS | 1691 | RSS: Main: 233496576 03:14:02 INFO - PROCESS | 1691 | 03:14:05 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-dft) 03:14:06 INFO - PROCESS | 1691 | RSS: Main: 241745920 03:14:06 INFO - PROCESS | 1691 | 03:14:09 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-fft) 03:14:10 INFO - PROCESS | 1691 | RSS: Main: 244174848 03:14:10 INFO - PROCESS | 1691 | 03:14:11 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-oscillator) 03:14:12 INFO - PROCESS | 1691 | RSS: Main: 246722560 03:14:12 INFO - PROCESS | 1691 | 03:14:14 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:14:15 INFO - PROCESS | 1691 | RSS: Main: 248119296 03:14:15 INFO - PROCESS | 1691 | 03:14:17 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-darkroom) 03:14:18 INFO - PROCESS | 1691 | RSS: Main: 247255040 03:14:18 INFO - PROCESS | 1691 | 03:14:21 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-desaturate) 03:14:22 INFO - PROCESS | 1691 | RSS: Main: 247865344 03:14:22 INFO - PROCESS | 1691 | 03:14:25 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49274/tests/kraken/driver.html?testName=json-parse-financial) 03:14:25 INFO - PROCESS | 1691 | RSS: Main: 247754752 03:14:25 INFO - PROCESS | 1691 | 03:14:27 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49274/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:14:27 INFO - PROCESS | 1691 | RSS: Main: 246087680 03:14:27 INFO - PROCESS | 1691 | 03:14:29 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:14:30 INFO - PROCESS | 1691 | RSS: Main: 246251520 03:14:30 INFO - PROCESS | 1691 | 03:14:32 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:14:33 INFO - PROCESS | 1691 | RSS: Main: 246525952 03:14:33 INFO - PROCESS | 1691 | 03:14:35 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:14:36 INFO - PROCESS | 1691 | RSS: Main: 248164352 03:14:36 INFO - PROCESS | 1691 | 03:14:39 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:14:39 INFO - PROCESS | 1691 | RSS: Main: 247861248 03:14:39 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49274/tests/kraken/driver.html?testName=ai-astar) 03:14:41 INFO - PROCESS | 1691 | RSS: Main: 249331712 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | __start_tp_report 03:14:41 INFO - PROCESS | 1691 | _x_x_mozilla_page_load 03:14:41 INFO - PROCESS | 1691 | _x_x_mozilla_page_load_details 03:14:41 INFO - PROCESS | 1691 | |i|pagename|runs| 03:14:41 INFO - PROCESS | 1691 | |0;ai-astar;115;107;114;114;117;129;114;111;113;114 03:14:41 INFO - PROCESS | 1691 | |1;audio-beat-detection;162;119;127;176;103;172;165;150;157;149 03:14:41 INFO - PROCESS | 1691 | |2;audio-dft;195;218;178;259;284;206;195;198;202;204 03:14:41 INFO - PROCESS | 1691 | |3;audio-fft;67;70;71;115;58;56;59;62;123;58 03:14:41 INFO - PROCESS | 1691 | |4;audio-oscillator;82;84;131;79;82;79;122;83;79;119 03:14:41 INFO - PROCESS | 1691 | |5;imaging-gaussian-blur;100;130;121;84;87;84;87;84;87;85 03:14:41 INFO - PROCESS | 1691 | |6;imaging-darkroom;149;139;93;94;93;92;94;94;93;95 03:14:41 INFO - PROCESS | 1691 | |7;imaging-desaturate;91;97;122;145;145;102;146;84;149;146 03:14:41 INFO - PROCESS | 1691 | |8;json-parse-financial;54;60;57;57;60;60;58;67;55;55 03:14:41 INFO - PROCESS | 1691 | |9;json-stringify-tinderbox;63;65;70;70;112;104;103;75;67;64 03:14:41 INFO - PROCESS | 1691 | |10;stanford-crypto-aes;84;84;84;81;84;83;84;84;82;84 03:14:41 INFO - PROCESS | 1691 | |11;stanford-crypto-ccm;135;131;112;127;132;133;142;120;118;131 03:14:41 INFO - PROCESS | 1691 | |12;stanford-crypto-pbkdf2;137;136;138;135;157;128;169;174;179;128 03:14:41 INFO - PROCESS | 1691 | |13;stanford-crypto-sha256-iterative;66;66;67;70;99;101;94;73;66;69 03:14:41 INFO - PROCESS | 1691 | __end_tp_report 03:14:41 INFO - PROCESS | 1691 | __start_cc_report 03:14:41 INFO - PROCESS | 1691 | _x_x_mozilla_cycle_collect,927 03:14:41 INFO - PROCESS | 1691 | __end_cc_report 03:14:41 INFO - PROCESS | 1691 | __startTimestamp1458900881657__endTimestamp 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | ------- Summary: start ------- 03:14:41 INFO - PROCESS | 1691 | Number of tests: 14 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#0] ai-astar Cycles:10 Average:114.80 Median:114.00 stddev:5.65 (5.0%) stddev-sans-first:6.00 03:14:41 INFO - PROCESS | 1691 | Values: 115.0 107.0 114.0 114.0 117.0 129.0 114.0 111.0 113.0 114.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#1] audio-beat-detection Cycles:10 Average:148.00 Median:159.50 stddev:24.12 (15.1%) stddev-sans-first:25.05 03:14:41 INFO - PROCESS | 1691 | Values: 162.0 119.0 127.0 176.0 103.0 172.0 165.0 150.0 157.0 149.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#2] audio-dft Cycles:10 Average:213.90 Median:205.00 stddev:32.53 (15.9%) stddev-sans-first:33.77 03:14:41 INFO - PROCESS | 1691 | Values: 195.0 218.0 178.0 259.0 284.0 206.0 195.0 198.0 202.0 204.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#3] audio-fft Cycles:10 Average:73.90 Median:60.50 stddev:24.41 (40.3%) stddev-sans-first:25.76 03:14:41 INFO - PROCESS | 1691 | Values: 67.0 70.0 71.0 115.0 58.0 56.0 59.0 62.0 123.0 58.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#4] audio-oscillator Cycles:10 Average:94.00 Median:80.50 stddev:20.98 (26.1%) stddev-sans-first:21.80 03:14:41 INFO - PROCESS | 1691 | Values: 82.0 84.0 131.0 79.0 82.0 79.0 122.0 83.0 79.0 119.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#5] imaging-gaussian-blur Cycles:10 Average:94.90 Median:84.50 stddev:16.93 (20.0%) stddev-sans-first:17.86 03:14:41 INFO - PROCESS | 1691 | Values: 100.0 130.0 121.0 84.0 87.0 84.0 87.0 84.0 87.0 85.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#6] imaging-darkroom Cycles:10 Average:103.60 Median:93.50 stddev:21.44 (22.9%) stddev-sans-first:15.19 03:14:41 INFO - PROCESS | 1691 | Values: 149.0 139.0 93.0 94.0 93.0 92.0 94.0 94.0 93.0 95.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#7] imaging-desaturate Cycles:10 Average:122.70 Median:147.50 stddev:26.59 (18.0%) stddev-sans-first:25.61 03:14:41 INFO - PROCESS | 1691 | Values: 91.0 97.0 122.0 145.0 145.0 102.0 146.0 84.0 149.0 146.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#8] json-parse-financial Cycles:10 Average:58.30 Median:59.00 stddev:3.77 (6.4%) stddev-sans-first:3.67 03:14:41 INFO - PROCESS | 1691 | Values: 54.0 60.0 57.0 57.0 60.0 60.0 58.0 67.0 55.0 55.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#9] json-stringify-tinderbox Cycles:10 Average:79.30 Median:66.00 stddev:19.11 (29.0%) stddev-sans-first:19.34 03:14:41 INFO - PROCESS | 1691 | Values: 63.0 65.0 70.0 70.0 112.0 104.0 103.0 75.0 67.0 64.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#10] stanford-crypto-aes Cycles:10 Average:83.40 Median:84.00 stddev:1.07 (1.3%) stddev-sans-first:1.12 03:14:41 INFO - PROCESS | 1691 | Values: 84.0 84.0 84.0 81.0 84.0 83.0 84.0 84.0 82.0 84.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#11] stanford-crypto-ccm Cycles:10 Average:128.10 Median:131.50 stddev:8.97 (6.8%) stddev-sans-first:9.17 03:14:41 INFO - PROCESS | 1691 | Values: 135.0 131.0 112.0 127.0 132.0 133.0 142.0 120.0 118.0 131.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:148.10 Median:147.50 stddev:19.70 (13.4%) stddev-sans-first:20.48 03:14:41 INFO - PROCESS | 1691 | Values: 137.0 136.0 138.0 135.0 157.0 128.0 169.0 174.0 179.0 128.0 03:14:41 INFO - PROCESS | 1691 | 03:14:41 INFO - PROCESS | 1691 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:77.10 Median:69.50 stddev:14.69 (21.1%) stddev-sans-first:15.02 03:14:41 INFO - PROCESS | 1691 | Values: 66.0 66.0 67.0 70.0 99.0 101.0 94.0 73.0 66.0 69.0 03:14:41 INFO - PROCESS | 1691 | -------- Summary: end -------- 03:14:41 INFO - PROCESS | 1691 | 03:14:42 INFO - TEST-INFO | 1691: exit 0 03:14:42 INFO - TEST-OK | kraken | took 58696ms 03:14:42 INFO - SUITE-END | took 1169s 03:14:42 INFO - Completed test suite (00:19:30) 03:14:42 INFO - javascript benchmark 03:14:42 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3485.1287178205444, 3532.1522834519706, 3560.4125319322297, 3590.084528445246, 3636.599974002859, 4727.55088266615, 5545.835374571335, 5852.385499522553, 5886.352501224862, 5899.321578018529, 5802.970985145079, 5816.447437493432, 5832.708364581765, 5838.2994040715175, 5852.707364631762, 5276.261323414725, 5318.92021619677, 5337.813176538822, 5341.439148889369, 5363.919541206885, 5178.974105129469, 5306.416294207634, 5315.521603055724, 5381.838544843661, 5389.595780316472, 5242.239875218091, 5292.497212764782, 5295.443978382272, 5297.231901374298, 5404.081306177959, 5355.464453554633, 5360.812371566996, 5388.811391601314, 5419.891602167934, 5470.9452905470835, 5067.847964561069, 5169.431362550116, 5281.445448227958, 5313.38896026958, 5314.309139811839, 5658.603897727161, 5678.772849086032, 5680.0, 5697.31632204134, 5717.656940583578, 6179.50563954887, 6289.87420251597, 6295.559310848243, 6301.590396624205, 6303.36966303366, 5360.249565060894, 6196.163517925068, 6216.937830621681, 6293.590916590407, 6294.968525157391, 5943.554233432466, 5972.581919265696, 5974.283086029661, 5974.701264936736, 5982.371850955674, 6389.456896163878, 6394.360563943662, 6399.360063993657, 6417.711202995876, 6440.645764482904, 6104.114903338991, 6150.907736383958, 6232.3144454110015, 6293.653849038255, 6318.684065796691, 6272.466840318624, 6295.213098362705, 6328.71520781566, 6336.144620476269, 6349.809505714836, 6119.746288422617, 6170.444659980623, 6288.717007734663, 6308.148399966038, 6310.085037669604, 6201.534884883652, 6239.438450539473, 6257.7184026718, 6273.529485288622, 6277.8744425111245, 4978.879752055758, 5025.095482813055, 5039.7228152451235, 5040.697558146523, 5054.646174767731, 4344.869653910388, 4350.71720338177, 4512.796924138422, 4519.389882365838, 4529.5243999380245, 5761.942380576141, 5919.822405327847, 5969.343372229051, 6003.489703375175, 6052.57631965767, 6262.780802671976, 6264.060390941395, 6270.749170033238, 6285.8742825143245, 6301.8109456716375, 5771.509421699203, 5780.682062486603, 5994.820155395345, 6039.184710064173, 6053.061775424816, 5475.479829416199, 5497.780088796403, 5499.230107784913, 5535.944640553624, 5552.7778888844805, 6459.224893012774, 6500.5449618526245, 6516.73933042673, 6517.446017088506, 6519.576227545289, 6204.627722336674, 6236.220472440945, 6250.156228909039, 6271.717772700148, 6308.936910630835, 6465.22417309907, 6467.611943283418, 6494.220693516808, 6494.805155845333, 6502.057201705632, 6232.314445411092, 6279.089532017741, 6282.371762823681, 6293.0, 6299.622022678654, 5279.812042290608, 6135.355787642412, 6173.166622505904, 6300.243970723543, 6313.842153946188, 6190.102435146789, 6234.314225435289, 6242.282137554058, 6254.437100660963, 6280.685965701788, 6218.471429928507, 6246.625202487683, 6247.5939063960695, 6255.155554000152, 6260.812175634738, 5816.41835816415, 6066.696665166813, 6115.938840611715, 6139.109829074849, 6158.230221222348, 6106.603070800384, 6143.627233423056, 6203.31763506023, 6210.975189093749, 6242.625442473466, 5918.053111502139, 6136.969315153396, 6137.294211165595, 6143.72353244114, 6148.877022459436], "unit": "score", "name": "dojo.html", "value": 5794.858338968974}, {"lowerIsBetter": false, "replicates": [487.5441462232815, 536.9033573956688, 548.5721137512742, 553.4603761332704, 561.7585136847566, 32152.839235803818, 38710.225795484075, 38838.417423738596, 38841.0, 38918.0, 42306.7307980761, 42884.71345859621, 43114.0, 43229.35155972663, 43257.567424325825, 8585.613647385882, 9570.952145239264, 9854.90145098547, 9893.25800564957, 9904.653337133203, 9678.322517423783, 9750.512474376288, 9789.363691360075, 9796.118349348557, 9801.803963920718, 9767.951160244189, 9815.263855210853, 9817.607295708163, 9827.606895724162, 9902.207823374112, 9730.756731081708, 9743.415395076318, 9775.364601300893, 9816.018398160199, 9818.6072557098, 8200.343972482187, 9699.806003879883, 9709.6601618943, 9721.90278097217, 9725.805483890354, 39715.20569588621, 39875.800620997, 40009.599904000876, 40202.59797402018, 40284.0, 2921.6494020717437, 3270.885519006847, 3276.7870088444415, 3329.6004479462617, 3481.3037392521596, 28277.57583636247, 29881.551776723365, 30052.098437046923, 30224.697753022407, 31552.368952621047, 2792.399634078683, 2836.078274560776, 2844.1751891951308, 2867.1541895140986, 2914.7231013053724, 471291.0, 472460.0, 476885.0, 479077.60461197817, 480524.0, 47154.5284547157, 72558.27441725621, 72811.63594181996, 72836.90744638834, 72908.90636640455, 47092.0, 47243.0, 47359.0, 47548.7622561885, 47588.0, 13727.382267797973, 16920.746188807178, 17166.742498862528, 17196.31214751396, 17734.0, 13134.277614731282, 13288.667783305302, 13300.800487992688, 13347.93326033383, 13389.933050334686, 15253.313600887986, 15310.693786124215, 15433.768493472608, 15479.226038698245, 15527.534173974798, 6514.967425162844, 6675.365840245266, 6806.76176333826, 6856.657167141722, 6860.348266914635, 1010.6765834932897, 1031.6028329093353, 1089.8910108989037, 1117.6311817100338, 1158.7972104881612, 30109.849450752605, 30342.84828575843, 30562.84718576393, 30795.230119247197, 30910.381792364027, 1127.3517727306833, 1134.89785919266, 1167.5154810753443, 1194.062660811259, 1210.431097384228, 15159.711424528818, 15359.61600959985, 15383.307751151226, 15532.767008494882, 15875.603109922344, 540640.0, 551146.0, 551166.0, 554533.0, 557404.0, 57212.71393643088, 61390.77218455606, 61581.692091539255, 62147.37852621416, 62398.68800655968, 1524.329295110148, 1531.4410240262446, 1544.2124516496892, 1554.8289688134296, 1556.9688606227812, 29850.0, 30154.0, 30218.79124834982, 30495.542566861957, 30992.380152397276, 52536.94926101533, 52634.473655262955, 52698.736506317226, 52993.41019769413, 52999.47000529945, 512971.0, 513475.0, 515650.0, 515913.0, 519112.0, 33731.662683373834, 34090.63637454474, 34820.477692835135, 35272.0, 35500.467492988144, 47020.0, 47259.76370118128, 47338.52661473341, 47531.52468475271, 47829.0, 32167.0, 38182.427263590514, 38325.61674383221, 38640.42039369468, 39700.00749981274, 37167.814160929025, 37977.43033854439, 38089.6191038086, 38285.042873928374, 38286.80856595699, 27527.0, 29980.700192997792, 38272.0, 38482.0, 39112.022199445244, 26592.0, 30925.536116957814, 31795.84102079475, 32559.674403256613, 32633.836830815693, 24937.501249975263, 25498.0, 25781.484370312864, 25902.740972590032, 25926.870365648807], "unit": "score", "name": "ext.html", "value": 19784.516887164533}, {"lowerIsBetter": false, "replicates": [384.21236465246255, 390.5294120584696, 390.9257833323463, 394.0778578127182, 400.19161294185744, 15614.890733357737, 16467.01197928125, 20150.39548813536, 20774.9612519374, 20791.584168316625, 20127.59744805103, 20315.39053828384, 20401.877896715712, 20511.692324615105, 21017.789822101775, 5733.226014488053, 5753.5684823638185, 5917.644941303535, 5978.9701051494685, 5992.43071908168, 5809.883802323951, 5811.651300921937, 5904.616199947011, 5909.349971503131, 5920.171176035358, 5664.26364572605, 5839.065749480084, 5901.439363260483, 5904.970475147618, 5955.523558115362, 5818.650880947114, 5837.182794408786, 5898.498627616657, 5916.940830591682, 5917.142014407908, 4861.270809378586, 5070.29015937769, 5121.718305493197, 5168.586513078944, 5175.870603234912, 25277.24168274936, 25480.235592932055, 25587.02276393616, 25819.0, 25936.351591210183, 2137.850350475467, 2277.259890535566, 2293.988530057339, 2313.4332088638225, 2368.230325144335, 14661.34023968924, 14772.704545909022, 14960.102393856294, 15022.624434389118, 15274.847251527453, 1742.8692848036321, 1826.9634607307912, 1876.962460750791, 1878.2205384765443, 1972.3491247888162, 80927.19072809255, 104151.0, 108017.99999999921, 108049.0, 109235.45382273117, 9063.773405664779, 11141.0, 11228.719282017852, 11239.60661376848, 11258.930401611833, 13263.071584989151, 13373.264470454023, 13400.865991340157, 13452.730945381234, 13481.730365392637, 9045.819083618422, 9155.81688366229, 9156.725298241063, 9176.0, 9263.305252106118, 9497.477638729799, 9535.52322383878, 9535.952320238355, 9546.809063818684, 9609.47147906858, 6455.677216139175, 6564.507661925375, 6568.7372505099265, 6576.408123268929, 6594.406503414716, 1952.2971730177126, 1983.2860170338668, 1990.3232900813794, 2003.4991252186953, 2003.6393449178995, 957.2772556719632, 1078.5577913055765, 1081.567373050786, 1101.730076131353, 1123.8482804821244, 20555.691664625043, 21311.68032479514, 21745.891270543547, 21802.127914883546, 21883.890580547315, 903.7605034665819, 1008.470552959702, 1048.9895101049044, 1051.0277992856577, 1108.6895669212633, 11613.941930290464, 11685.006774424099, 11931.642050738317, 11951.22317049389, 11955.043596512432, 618566.0, 643271.0, 654219.0, 655006.0, 665905.0, 60172.69913650404, 70238.64880675563, 98844.03467895975, 112501.31248031123, 114411.42794285975, 913.456493386434, 1039.3192458939407, 1062.4103622489592, 1070.240129508058, 1072.544168728303, 18725.90637046806, 19019.809801901803, 19191.52021199481, 19413.417597471533, 19501.609967800847, 49743.756406090135, 50696.23955640595, 51870.96258074893, 52287.73856130695, 53882.0, 70341.0, 72003.63998179976, 72069.0, 73386.0, 74419.62790186015, 7944.44388892772, 8027.438079334391, 8077.474964127313, 8144.592770361577, 8165.918340816754, 12099.637010889688, 12455.252684838939, 12754.553590624284, 13666.590002299947, 13807.102538334975, 11095.611653592085, 11671.36600875861, 11757.0, 11903.047756179658, 11933.045356371644, 9238.630454782002, 11610.24533405326, 11623.6512904613, 11734.589289374831, 11875.40654746255, 9225.49259790718, 10956.726081847699, 11559.884401155881, 12126.090543209471, 12175.573854915036, 7953.6818527258265, 8018.3585313173635, 8183.304419124441, 8188.303994160563, 8228.958855205685, 11797.0, 11908.52365905354, 11945.641630751092, 12044.698882528008, 12136.271823690608], "unit": "score", "name": "jquery.html", "value": 9780.487925837346}, {"lowerIsBetter": false, "replicates": [1269.3209133113783, 1619.849906566338, 1750.921208545616, 1842.4104286628276, 2054.465838881892, 8023.0, 8806.163414475623, 8869.201771840533, 8989.50557719326, 8991.280697544196, 8894.066123057082, 8912.777180570489, 8986.37095403322, 8994.68518601849, 9006.09939006099, 2502.4244423782543, 2523.6088406297054, 2523.6466894634764, 2527.9620805687928, 2538.23852844146, 2471.159805666073, 2526.6462695222685, 2531.3038914298622, 2539.4032402385424, 2552.1067626330823, 2507.69907611086, 2522.255934499327, 2530.101813856082, 2555.591105423133, 2557.8593177375237, 2512.623106534007, 2524.432002799374, 2532.050481069599, 2534.746525347469, 2538.225841118458, 2499.9250022499355, 2527.5829488134436, 2529.53203657324, 2531.1394125997067, 2548.019012680113, 9135.77160570991, 9165.358424910259, 9175.311851611155, 9178.128077832594, 9209.0, 4613.677042607019, 4722.551357621055, 5663.433656634304, 5704.71476426177, 5725.312962444534, 3549.3078849624335, 3598.1364472526666, 3614.4397618369194, 3657.3233951718753, 3657.7073834093476, 902.3773596218588, 914.1863741270275, 927.679950417105, 932.5104320231865, 975.3806332978538, 12131.21147125434, 12231.204971676902, 12288.569900053544, 12300.938495307555, 12301.753964920741, 4344.196323680129, 4838.153323168432, 4954.0, 5061.544460998454, 5062.088824011639, 10347.0, 10360.689179324632, 10366.222533310032, 10412.5834966602, 10448.111910487542, 5520.06158952971, 5622.0, 5628.831135065954, 5632.943670563324, 5645.4072322405555, 4508.752018638941, 4851.733154676456, 4952.083864485082, 5052.368453943257, 5058.924116138261, 3591.94612080819, 4066.7620978965106, 4125.793710314472, 4129.834806607702, 4174.478190226222, 1341.336038660869, 1347.730453909222, 1357.4841560207255, 1360.183889666212, 1366.9658258543616, 1374.9725005500034, 1380.3926272440094, 1387.7432674955166, 1409.598264494614, 1413.2227274998709, 8340.207680270365, 8499.532525711145, 8563.871541926752, 8587.184217499327, 8588.52763098023, 453.5849697526792, 522.2036394498421, 525.9684418934876, 531.7660229499008, 540.108820446259, 6193.225846769154, 6241.750329986749, 6303.9684801575695, 6317.6209427434505, 6367.872642547123, 9470.810583788285, 10723.83914241287, 11043.226974111896, 11047.005769480786, 11112.555497779998, 10576.153907687367, 10733.892661073445, 10944.726381840359, 10977.670669879917, 11019.614313499149, 8467.237948584658, 8564.229219370287, 8565.571721413904, 8591.968963724394, 8619.525926074, 7950.64222110018, 7996.800079997814, 8054.959725201336, 8064.112947575644, 8175.591220439073, 9682.903170968482, 9902.405855648396, 9905.999999999713, 9918.454485003105, 9923.851142232728, 9968.900310997087, 10181.33821301613, 10219.131373833308, 10323.380597164194, 10360.53377598025, 7299.6350182489605, 7491.288327608869, 7499.987501687202, 7542.170361260367, 7580.54516728998, 8440.53577053268, 8450.788730281793, 8463.069062403254, 8486.448380855225, 8545.572721363782, 7317.0, 7527.887081693889, 7560.319571238615, 7570.886436703344, 7642.847143057219, 7212.206657267801, 7258.346748792634, 7289.979402883495, 7364.226756190523, 7385.630718464163, 7950.284474397332, 7968.681252749825, 7982.121966583787, 8004.479708818908, 8024.277814996678, 7182.0663313770965, 7187.5687458752645, 7189.065421495172, 7232.710691572489, 7258.0927384076995, 7264.982902393564, 7327.780166595011, 7331.266873312626, 7366.96316518414, 7375.557466552024], "unit": "score", "name": "mootools.html", "value": 4940.219066336391}, {"lowerIsBetter": false, "replicates": [300.1730233207513, 337.73994024601075, 342.9434143366345, 344.63468723153443, 345.7009686621073, 6912.792616221509, 6917.230109590273, 6947.166340039196, 6950.165980082397, 6992.580445173293, 6883.896741548869, 6907.378335949764, 6916.827079323007, 6925.930740692592, 6930.5148639595245, 4869.683470574419, 4925.285833554132, 5071.670341427814, 5082.907174957383, 5154.201098829678, 5049.545540901318, 5077.390713114413, 5093.26147708582, 5106.106431374495, 5117.33474648297, 5004.324416203803, 5013.573846223057, 5015.846355338274, 5038.5969122470115, 5042.747862606873, 5018.974905125469, 5032.798688052473, 5037.14368557348, 5050.217216331474, 5057.822976195852, 3774.1885494618514, 4249.596288352602, 4358.607725304738, 4363.192809330284, 4367.344898265285, 6330.556861019731, 6684.966575167093, 6692.83267918306, 6717.596944183316, 6725.596464212163, 5952.136940143699, 5995.700214989233, 5999.820005399845, 6016.097585362187, 6017.217761690952, 7479.700811967515, 7494.288042635941, 7502.5873576953245, 7568.318851303354, 7591.658375373121, 4788.162071637449, 4793.3049707792525, 4803.759812009421, 4809.110314591777, 4820.204666230068, 6362.840928976766, 7673.271039251206, 7834.764957051298, 7929.28636422719, 7932.563708996003, 4812.085703716282, 4865.0, 4879.731614761151, 4881.194602890554, 4885.900672348693, 4927.876803079952, 4953.975230123826, 4968.30443737877, 4986.975065124651, 4991.725455100004, 5980.671063091485, 5989.101634754822, 5990.6705131218205, 5993.610415323077, 6002.429769171922, 7522.548647081193, 7531.020967274219, 7534.54792712439, 7560.659770310349, 7576.772696819105, 1697.0835748695565, 1721.8794684372224, 1725.7660772547688, 1726.3181043487753, 1728.1445684386308, 1054.056619325699, 1091.5306418240075, 1096.9396683182501, 1097.3964319624174, 1100.6037826382496, 6822.249552549216, 6937.653117344113, 6970.651467426608, 6987.825304367431, 7010.789676309617, 7389.8152546186775, 7707.421943354158, 7719.729809456754, 7741.496802707806, 7782.299593036654, 6822.863542729117, 7069.71721131149, 7080.398166155832, 7086.7519636813495, 7103.112110986127, 4091.57038510958, 4140.710150289511, 4141.358089496133, 4142.275101857163, 4143.150654115899, 8198.877016844752, 8231.382646301552, 8233.917660823436, 8243.175682431709, 8245.711400100967, 7794.0, 8072.919270807217, 8076.515409075474, 8107.675692972333, 8128.634211460499, 8149.225823546753, 8197.05733840604, 8201.056878458934, 8202.917970820215, 8244.216799404046, 6319.842003949938, 7801.2198780121535, 7806.765797026098, 7811.062672479339, 7829.0, 6757.3580509853455, 7664.923350766644, 7679.923200767921, 7682.577458239851, 7723.227677232232, 6574.3754343337305, 7909.5254284740795, 8166.7958301042945, 8190.918090819254, 8200.343972482306, 4119.505659320901, 4758.191107511662, 4849.781759820746, 4869.805207791649, 4872.123017856819, 7775.339096176888, 7779.533228006338, 7780.0, 7780.2219778021745, 7800.1419843816, 7253.3834624057545, 7485.326320631169, 7491.325780679765, 7496.550206987598, 7508.887366689613, 7449.0, 7475.663595138123, 7477.027986361738, 7483.663235154322, 7509.812254693457, 7295.7081716732855, 7296.0, 7313.378362839218, 7321.853562928818, 7329.52358096722, 7459.216782237787, 7479.102507699111, 7487.5507469552, 7489.850202995801, 7506.474546781673, 7023.192332881784, 7323.084614423197, 7341.972123902551, 7363.668634911549, 7367.44744144202], "unit": "score", "name": "prototype.html", "value": 5434.297528254606}, {"lowerIsBetter": false, "replicates": [757.3794670440276, 757.5076200469695, 781.3475747750628, 783.2637320918336, 794.7734895554764, 13728.244946527937, 13862.792058119136, 13938.0, 13939.651508712263, 13963.860361396395, 13567.525136620221, 13613.319334033284, 13633.727325453485, 13633.795493067611, 13639.0, 778.2178910195246, 957.4016239850093, 968.9563969621383, 981.8576306435563, 992.7270000749816, 833.7790485521342, 973.0221127766584, 978.8580655804903, 999.8050380175832, 1000.1099021870505, 1001.219049141667, 1010.5957616953204, 1042.7549525861416, 1044.5456226541442, 1051.568856768725, 989.0406305883282, 1027.6146445083018, 1033.225081189108, 1036.7045392063264, 1042.2027149230844, 767.6353731977322, 769.1308821032197, 774.6243072110022, 774.8760198368234, 776.9937930380171, 15444.922775386163, 15528.689426211526, 15574.610634734108, 15581.298841552158, 15608.29762660683, 12953.611391658265, 12961.287129207889, 13093.297821593285, 13124.737505249937, 13147.342632868318, 8600.612972416257, 9980.600775968953, 10100.646477373257, 10262.281640285182, 10595.364278143259, 3465.878694245689, 3504.229069604683, 3542.4509201073615, 3597.478365636994, 3759.6992240620957, 56270.71864640692, 81889.59055204745, 83075.0, 83224.58387708083, 83625.0, 9577.473238971923, 9703.466309353053, 9764.755881103029, 10318.948405257926, 10455.790884182274, 21338.78661213399, 21338.893305533373, 21534.13863445476, 21585.784142158693, 21640.350789476026, 7403.666834992438, 7572.280633339824, 7613.390928725688, 7721.691132354756, 7724.459287849909, 3968.151410025766, 4117.505899292104, 4125.154343359604, 4131.5455299916985, 4196.580341965779, 2725.3867879726904, 3041.361314124059, 3196.456602377555, 3619.7828130312264, 3638.3632864248652, 672.5460314287934, 681.1145510835894, 688.1295161620554, 690.102866273842, 691.5885048396196, 469.5679974423538, 522.8300802239287, 546.4371697151939, 582.6940856050522, 584.6608966799331, 7868.370530357558, 8288.129746376544, 8346.457480263764, 8423.284020858173, 8598.613062412207, 600.7236671131241, 601.8826328865916, 614.9692515374303, 619.9442050215412, 626.6428135962549, 3104.98447507761, 3711.662820982551, 3794.032521706947, 3824.0, 3874.341361968472, 99508.50245748869, 100517.49741251247, 101108.49445752871, 101662.49168754257, 101928.0, 83053.58473207595, 83631.3273734534, 84703.0, 85645.0, 86624.56687716521, 60589.09116363258, 74494.0, 74962.0, 78353.60823195962, 80552.0, 8419.200175983271, 8618.913810861812, 8640.870386944327, 8643.394962352575, 8752.649894004424, 47015.0, 49608.255876162606, 52955.0, 53023.20465192948, 53250.46749532455, 66001.019969401, 69672.0, 73249.0, 74728.0, 76550.0, 10760.46197690128, 10781.784364312512, 10850.348979061282, 11019.889801101886, 11297.43512824372, 11939.701507462383, 11971.521139154336, 11988.100892432927, 11998.64004079879, 12461.127721059438, 11493.655190344303, 11497.0, 11501.884981150082, 11666.358350290815, 12315.630531084082, 11044.226904116635, 11487.942560287145, 11549.422528873354, 11641.825372619249, 12317.44571494267, 10352.430616316175, 11318.434078296217, 11321.320720756781, 11352.659420217407, 11559.479823407799, 9516.809663806824, 9521.238300936047, 9659.0, 9965.35225210359, 10021.248406369406, 9475.576210762467, 9645.180159686224, 9669.419834809934, 9691.07934746198, 9753.512324383895], "unit": "score", "name": "yui.html", "value": 7049.304574032796}], "name": "dromaeo_css", "value": 7723.242489395259}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [115.0, 107.0, 114.0, 114.0, 117.0, 129.0, 114.0, 111.0, 113.0, 114.0], "unit": "score", "name": "ai-astar", "value": 114.8}, {"lowerIsBetter": true, "replicates": [162.0, 119.0, 127.0, 176.0, 103.0, 172.0, 165.0, 150.0, 157.0, 149.0], "unit": "score", "name": "audio-beat-detection", "value": 148.0}, {"lowerIsBetter": true, "replicates": [195.0, 218.0, 178.0, 259.0, 284.0, 206.0, 195.0, 198.0, 202.0, 204.0], "unit": "score", "name": "audio-dft", "value": 213.9}, {"lowerIsBetter": true, "replicates": [67.0, 70.0, 71.0, 115.0, 58.0, 56.0, 59.0, 62.0, 123.0, 58.0], "unit": "score", "name": "audio-fft", "value": 73.9}, {"lowerIsBetter": true, "replicates": [82.0, 84.0, 131.0, 79.0, 82.0, 79.0, 122.0, 83.0, 79.0, 119.0], "unit": "score", "name": "audio-oscillator", "value": 94.0}, {"lowerIsBetter": true, "replicates": [100.0, 130.0, 121.0, 84.0, 87.0, 84.0, 87.0, 84.0, 87.0, 85.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 94.9}, {"lowerIsBetter": true, "replicates": [149.0, 139.0, 93.0, 94.0, 93.0, 92.0, 94.0, 94.0, 93.0, 95.0], "unit": "score", "name": "imaging-darkroom", "value": 103.6}, {"lowerIsBetter": true, "replicates": [91.0, 97.0, 122.0, 145.0, 145.0, 102.0, 146.0, 84.0, 149.0, 146.0], "unit": "score", "name": "imaging-desaturate", "value": 122.7}, {"lowerIsBetter": true, "replicates": [54.0, 60.0, 57.0, 57.0, 60.0, 60.0, 58.0, 67.0, 55.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 58.3}, {"lowerIsBetter": true, "replicates": [63.0, 65.0, 70.0, 70.0, 112.0, 104.0, 103.0, 75.0, 67.0, 64.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 79.3}, {"lowerIsBetter": true, "replicates": [84.0, 84.0, 84.0, 81.0, 84.0, 83.0, 84.0, 84.0, 82.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.4}, {"lowerIsBetter": true, "replicates": [135.0, 131.0, 112.0, 127.0, 132.0, 133.0, 142.0, 120.0, 118.0, 131.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 128.1}, {"lowerIsBetter": true, "replicates": [137.0, 136.0, 138.0, 135.0, 157.0, 128.0, 169.0, 174.0, 179.0, 128.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 148.1}, {"lowerIsBetter": true, "replicates": [66.0, 66.0, 67.0, 70.0, 99.0, 101.0, 94.0, 73.0, 66.0, 69.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 77.1}], "name": "kraken", "value": 1540.1}]} 03:14:42 INFO - Return code: 0 03:14:42 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 03:14:42 ERROR - # TBPL SUCCESS # 03:14:42 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:14:42 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:14:42 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:14:42 INFO - 2016-03-25 03:14:42.970 screenresolution[1696:11047] starting screenresolution argv=screenresolution get 03:14:42 INFO - 2016-03-25 03:14:42.972 screenresolution[1696:11047] Display 0: 1600x1200x32@60 03:14:42 INFO - 2016-03-25 03:14:42.978 screenresolution[1697:11050] starting screenresolution argv=screenresolution list 03:14:42 INFO - Available Modes on Display 0 03:14:42 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:14:42 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:14:42 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:14:42 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:14:43 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:14:43 INFO - Intel Iris: 03:14:43 INFO - Chipset Model: Intel Iris 03:14:43 INFO - Type: GPU 03:14:43 INFO - Bus: Built-In 03:14:43 INFO - VRAM (Dynamic, Max): 1536 MB 03:14:43 INFO - Vendor: Intel (0x8086) 03:14:43 INFO - Device ID: 0x0a2e 03:14:43 INFO - Revision ID: 0x0009 03:14:43 INFO - Displays: 03:14:43 INFO - Display: 03:14:43 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:14:43 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:14:43 INFO - Display Serial Number: 1600x1200 60 03:14:43 INFO - Main Display: Yes 03:14:43 INFO - Mirror: Off 03:14:43 INFO - Online: Yes 03:14:43 INFO - Rotation: Supported 03:14:43 INFO - Return code: 0 03:14:43 INFO - Running post-action listener: _resource_record_post_action 03:14:43 INFO - Running post-run listener: _resource_record_post_run 03:14:44 INFO - Total resource usage - Wall time: 1203s; CPU: 53.0%; Read bytes: 32308736; Write bytes: 665625088; Read time: 327; Write time: 1993 03:14:44 INFO - install - Wall time: 32s; CPU: 54.0%; Read bytes: 361517568; Write bytes: 362677760; Read time: 28472; Write time: 649 03:14:44 INFO - run-tests - Wall time: 1172s; CPU: 53.0%; Read bytes: 30522880; Write bytes: 300045312; Read time: 307; Write time: 1301 03:14:44 INFO - Running post-run listener: _upload_blobber_files 03:14:44 INFO - Blob upload gear active. 03:14:44 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:14:44 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 03:14:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:14:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:14:44 INFO - (blobuploader) - INFO - Open directory for files ... 03:14:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 03:14:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:14:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:14:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 03:14:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:14:45 INFO - (blobuploader) - INFO - Done attempting. 03:14:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 03:14:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:14:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:14:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 03:14:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:14:46 INFO - (blobuploader) - INFO - Done attempting. 03:14:46 INFO - (blobuploader) - INFO - Iteration through files over. 03:14:46 INFO - Return code: 0 03:14:46 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:14:46 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:14:46 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b53393e9eb40bd187dac48316fb89b692b529b7453c7b2b168794e6f755cf4993effc7d74273c708430f937981650a7c7b31d509299c2a7110e4ca15bfe6ed7a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4ea2e73d37e6c01bbf579abed326fee949a1d8a40eb149836001937baba15f2d0095bcce52001a831049613c8a562c3f2bfc5c66033b47557190a507b3152633"} 03:14:46 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:14:46 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:14:46 INFO - Contents: 03:14:46 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b53393e9eb40bd187dac48316fb89b692b529b7453c7b2b168794e6f755cf4993effc7d74273c708430f937981650a7c7b31d509299c2a7110e4ca15bfe6ed7a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4ea2e73d37e6c01bbf579abed326fee949a1d8a40eb149836001937baba15f2d0095bcce52001a831049613c8a562c3f2bfc5c66033b47557190a507b3152633"} 03:14:46 INFO - Running post-run listener: copy_logs_to_upload_dir 03:14:46 INFO - Copying logs to upload dir... 03:14:46 INFO - mkdir: /builds/slave/test/build/upload/logs 03:14:46 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1344.927143 ========= master_lag: 0.06 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 24 secs) (at 2016-03-25 03:14:46.975569) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 3 secs) (at 2016-03-25 03:14:46.979136) ========= 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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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/b53393e9eb40bd187dac48316fb89b692b529b7453c7b2b168794e6f755cf4993effc7d74273c708430f937981650a7c7b31d509299c2a7110e4ca15bfe6ed7a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4ea2e73d37e6c01bbf579abed326fee949a1d8a40eb149836001937baba15f2d0095bcce52001a831049613c8a562c3f2bfc5c66033b47557190a507b3152633"} build_url:https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011244 build_url: 'https://queue.taskcluster.net/v1/task/fpqtIUkiStiy52BAuHadQw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b53393e9eb40bd187dac48316fb89b692b529b7453c7b2b168794e6f755cf4993effc7d74273c708430f937981650a7c7b31d509299c2a7110e4ca15bfe6ed7a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4ea2e73d37e6c01bbf579abed326fee949a1d8a40eb149836001937baba15f2d0095bcce52001a831049613c8a562c3f2bfc5c66033b47557190a507b3152633"}' ========= master_lag: 2.99 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 3 secs) (at 2016-03-25 03:14:49.980890) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 03:14:49.981208) ========= 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.10XSqqe7Qk/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.hmYmSQyo7s/Listeners TMPDIR=/var/folders/29/m_1c7lhj4kb13s_f9szps0wr00000w/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.005130 ========= master_lag: 0.03 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-25 03:14:50.012711) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-25 03:14:50.013045) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-25 03:14:50.013938) ========= ========= Total master_lag: 3.56 =========