builder: mozilla-central_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0100 starttime: 1459854406.65 results: success (0) buildid: 20160405020119 builduid: 03e53c4abfc04aa298a6c63814ff7928 revision: d9f50aa0a1aaf90499b85c31e0f329b762e80fdd ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:46.645962) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:46.646401) ========= ========= Started set props: basedir (results: 0, elapsed: 8 secs) (at 2016-04-05 04:06:46.646691) ========= 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.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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.005502 basedir: '/builds/slave/test' ========= master_lag: 8.65 ========= ========= Finished set props: basedir (results: 0, elapsed: 8 secs) (at 2016-04-05 04:06:55.300534) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-04-05 04:06:55.300839) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-04-05 04:06:56.322991) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:56.323372) ========= 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.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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.005380 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:56.349961) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:56.350284) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:56.350655) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-05 04:06:56.350946) ========= 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.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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-04-05 04:06:56-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 38.9M=0s 2016-04-05 04:06:57 (38.9 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.875670 ========= master_lag: 0.30 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-05 04:06:57.527554) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:57.527938) ========= 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.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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.026598 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:57.570987) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-05 04:06:57.571334) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev d9f50aa0a1aaf90499b85c31e0f329b762e80fdd --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev d9f50aa0a1aaf90499b85c31e0f329b762e80fdd --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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-04-05 04:06:57,648 truncating revision to first 12 chars 2016-04-05 04:06:57,648 Setting DEBUG logging. 2016-04-05 04:06:57,648 attempt 1/10 2016-04-05 04:06:57,649 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/d9f50aa0a1aa?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-05 04:06:58,755 unpacking tar archive at: mozilla-central-d9f50aa0a1aa/testing/mozharness/ program finished with exit code 0 elapsedTime=1.376389 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-05 04:06:58.966019) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:58.966330) ========= echo d9f50aa0a1aaf90499b85c31e0f329b762e80fdd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'd9f50aa0a1aaf90499b85c31e0f329b762e80fdd'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 d9f50aa0a1aaf90499b85c31e0f329b762e80fdd program finished with exit code 0 elapsedTime=0.005772 script_repo_revision: 'd9f50aa0a1aaf90499b85c31e0f329b762e80fdd' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:59.015712) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:59.016043) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-05 04:06:59.035740) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 16 secs) (at 2016-04-05 04:06:59.036022) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:06:59 INFO - MultiFileLogger online at 20160405 04:06:59 in /builds/slave/test 04:06:59 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 04:06:59 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:06:59 INFO - {'append_to_log': False, 04:06:59 INFO - 'base_work_dir': '/builds/slave/test', 04:06:59 INFO - 'blob_upload_branch': 'Firefox', 04:06:59 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:06:59 INFO - 'branch': 'Firefox', 04:06:59 INFO - 'buildbot_json_path': 'buildprops.json', 04:06:59 INFO - 'config_files': ('talos/mac_config.py',), 04:06:59 INFO - 'default_actions': ('clobber', 04:06:59 INFO - 'read-buildbot-config', 04:06:59 INFO - 'download-and-extract', 04:06:59 INFO - 'populate-webroot', 04:06:59 INFO - 'create-virtualenv', 04:06:59 INFO - 'install', 04:06:59 INFO - 'run-tests'), 04:06:59 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:06:59 INFO - 'download_minidump_stackwalk': True, 04:06:59 INFO - 'download_symbols': 'ondemand', 04:06:59 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:06:59 INFO - 'tooltool.py': '/tools/tooltool.py', 04:06:59 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:06:59 INFO - '/tools/misc-python/virtualenv.py')}, 04:06:59 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:06:59 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:06:59 INFO - 'installer_path': 'installer.exe', 04:06:59 INFO - 'log_level': 'info', 04:06:59 INFO - 'log_name': 'talos', 04:06:59 INFO - 'log_to_console': True, 04:06:59 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 04:06:59 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 04:06:59 INFO - 'opt_config_files': (), 04:06:59 INFO - 'pip_index': False, 04:06:59 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 04:06:59 INFO - 'cmd': ('bash', 04:06:59 INFO - '-c', 04:06:59 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 04:06:59 INFO - 'enabled': True, 04:06:59 INFO - 'halt_on_failure': False, 04:06:59 INFO - 'name': 'check_screen_resolution'},), 04:06:59 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 04:06:59 INFO - 'cmd': ('bash', 04:06:59 INFO - '-c', 04:06:59 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 04:06:59 INFO - 'enabled': True, 04:06:59 INFO - 'halt_on_failure': False, 04:06:59 INFO - 'name': 'check_screen_resolution'},), 04:06:59 INFO - 'run_cmd_checks_enabled': True, 04:06:59 INFO - 'sps_profile': False, 04:06:59 INFO - 'sps_profile_interval': 0, 04:06:59 INFO - 'suite': 'dromaeojs-e10s', 04:06:59 INFO - 'system_bits': '32', 04:06:59 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:06:59 INFO - 'title': 't-yosemite-r7-0100', 04:06:59 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:06:59 INFO - 'use_talos_json': True, 04:06:59 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:06:59 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:06:59 INFO - 'work_dir': 'build'} 04:06:59 INFO - ##### 04:06:59 INFO - ##### Running clobber step. 04:06:59 INFO - ##### 04:06:59 INFO - Running pre-action listener: _resource_record_pre_action 04:06:59 INFO - Running main action method: clobber 04:06:59 INFO - rmtree: /builds/slave/test/build 04:06:59 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:07:00 INFO - Running post-action listener: _resource_record_post_action 04:07:00 INFO - ##### 04:07:00 INFO - ##### Running read-buildbot-config step. 04:07:00 INFO - ##### 04:07:00 INFO - Running pre-action listener: _resource_record_pre_action 04:07:00 INFO - Running main action method: read_buildbot_config 04:07:00 INFO - Using buildbot properties: 04:07:00 INFO - { 04:07:00 INFO - "project": "", 04:07:00 INFO - "product": "firefox", 04:07:00 INFO - "script_repo_revision": "production", 04:07:00 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs-e10s", 04:07:00 INFO - "repository": "", 04:07:00 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs-e10s", 04:07:00 INFO - "buildid": "20160405020119", 04:07:00 INFO - "pgo_build": "False", 04:07:00 INFO - "basedir": "/builds/slave/test", 04:07:00 INFO - "buildnumber": 228, 04:07:00 INFO - "slavename": "t-yosemite-r7-0100", 04:07:00 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 04:07:00 INFO - "platform": "yosemite_r7", 04:07:00 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 04:07:00 INFO - "branch": "mozilla-central", 04:07:00 INFO - "repo_path": "mozilla-central", 04:07:00 INFO - "revision": "d9f50aa0a1aaf90499b85c31e0f329b762e80fdd", 04:07:00 INFO - "stage_platform": "macosx64", 04:07:00 INFO - "builduid": "03e53c4abfc04aa298a6c63814ff7928", 04:07:00 INFO - "slavebuilddir": "test" 04:07:00 INFO - } 04:07:00 INFO - Found installer url https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg. 04:07:00 INFO - Running post-action listener: _resource_record_post_action 04:07:00 INFO - ##### 04:07:00 INFO - ##### Running download-and-extract step. 04:07:00 INFO - ##### 04:07:00 INFO - Running pre-action listener: _resource_record_pre_action 04:07:00 INFO - Running main action method: download_and_extract 04:07:00 INFO - mkdir: /builds/slave/test/build/tests 04:07:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:00 INFO - https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 04:07:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 04:07:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 04:07:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 04:07:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json'}, attempt #1 04:07:02 INFO - Downloaded 1199 bytes. 04:07:02 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 04:07:02 INFO - Using the following test package requirements: 04:07:02 INFO - {u'common': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 04:07:02 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:07:02 INFO - u'firefox-48.0a1.en-US.mac.cppunittest.tests.zip'], 04:07:02 INFO - u'gtest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:07:02 INFO - u'firefox-48.0a1.en-US.mac.gtest.tests.zip'], 04:07:02 INFO - u'jittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:07:02 INFO - u'jsshell-mac.zip'], 04:07:02 INFO - u'mochitest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:07:02 INFO - u'firefox-48.0a1.en-US.mac.mochitest.tests.zip'], 04:07:02 INFO - u'mozbase': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 04:07:02 INFO - u'reftest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:07:02 INFO - u'firefox-48.0a1.en-US.mac.reftest.tests.zip'], 04:07:02 INFO - u'talos': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:07:02 INFO - u'firefox-48.0a1.en-US.mac.talos.tests.zip'], 04:07:02 INFO - u'web-platform': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:07:02 INFO - u'firefox-48.0a1.en-US.mac.web-platform.tests.zip'], 04:07:02 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:07:02 INFO - u'firefox-48.0a1.en-US.mac.xpcshell.tests.zip']} 04:07:02 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip'] for test suite category: common 04:07:02 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')]} 04:07:02 INFO - https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 04:07:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:07:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:07:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:07:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 04:07:04 INFO - Downloaded 17959933 bytes. 04:07:04 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:07:04 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 04:07:07 INFO - Return code: 0 04:07:07 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip', u'firefox-48.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 04:07:07 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')]} 04:07:07 INFO - https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 04:07:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:07:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:07:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:07:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 04:07:09 INFO - Downloaded 17959933 bytes. 04:07:09 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:07:09 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 04:07:12 INFO - Return code: 0 04:07:12 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')]} 04:07:12 INFO - https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 04:07:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 04:07:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 04:07:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip 04:07:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip'}, attempt #1 04:07:16 INFO - Downloaded 10847584 bytes. 04:07:16 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:07:16 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 04:07:17 INFO - Return code: 0 04:07:17 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')]} 04:07:17 INFO - https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 04:07:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 04:07:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 04:07:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg 04:07:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg'}, attempt #1 04:07:28 INFO - Downloaded 111354357 bytes. 04:07:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 04:07:28 INFO - mkdir: /builds/slave/test/properties 04:07:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:07:28 INFO - Writing to file /builds/slave/test/properties/build_url 04:07:28 INFO - Contents: 04:07:28 INFO - build_url:https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 04:07:29 INFO - Running post-action listener: _resource_record_post_action 04:07:29 INFO - Running post-action listener: set_extra_try_arguments 04:07:29 INFO - ##### 04:07:29 INFO - ##### Running populate-webroot step. 04:07:29 INFO - ##### 04:07:29 INFO - Running pre-action listener: _resource_record_pre_action 04:07:29 INFO - Running main action method: populate_webroot 04:07:29 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:07:29 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:07:29 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:07:29 INFO - '--tppagecycles', 04:07:29 INFO - '7'], 04:07:29 INFO - 'tests': ['tsvgm']}}, 04:07:29 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:07:29 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:07:29 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 04:07:29 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:07:29 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:07:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:07:29 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:07:29 INFO - 'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:07:29 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:07:29 INFO - 'tests': ['damp', 'tps']}, 04:07:29 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:07:29 INFO - 'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['damp', 'tps']}, 04:07:29 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:07:29 INFO - 'g3-e10s': {'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['dromaeo_dom']}, 04:07:29 INFO - 'other': {'tests': ['a11yr', 04:07:29 INFO - 'ts_paint', 04:07:29 INFO - 'tpaint', 04:07:29 INFO - 'sessionrestore', 04:07:29 INFO - 'sessionrestore_no_auto_restore', 04:07:29 INFO - 'tabpaint']}, 04:07:29 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['a11yr', 04:07:29 INFO - 'ts_paint', 04:07:29 INFO - 'tpaint', 04:07:29 INFO - 'sessionrestore', 04:07:29 INFO - 'sessionrestore_no_auto_restore', 04:07:29 INFO - 'tabpaint']}, 04:07:29 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['a11yr', 04:07:29 INFO - 'ts_paint', 04:07:29 INFO - 'tpaint', 04:07:29 INFO - 'sessionrestore', 04:07:29 INFO - 'sessionrestore_no_auto_restore', 04:07:29 INFO - 'tabpaint']}, 04:07:29 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['a11yr', 04:07:29 INFO - 'ts_paint', 04:07:29 INFO - 'tpaint', 04:07:29 INFO - 'sessionrestore', 04:07:29 INFO - 'sessionrestore_no_auto_restore', 04:07:29 INFO - 'tabpaint']}, 04:07:29 INFO - 'other_l64': {'tests': ['a11yr', 04:07:29 INFO - 'ts_paint', 04:07:29 INFO - 'tpaint', 04:07:29 INFO - 'sessionrestore', 04:07:29 INFO - 'sessionrestore_no_auto_restore', 04:07:29 INFO - 'tabpaint']}, 04:07:29 INFO - 'other_nol64': {'tests': ['a11yr', 04:07:29 INFO - 'ts_paint', 04:07:29 INFO - 'tpaint', 04:07:29 INFO - 'sessionrestore', 04:07:29 INFO - 'sessionrestore_no_auto_restore', 04:07:29 INFO - 'tabpaint']}, 04:07:29 INFO - 'svgr': {'tests': ['tsvgx', 04:07:29 INFO - 'tsvgr_opacity', 04:07:29 INFO - 'tart', 04:07:29 INFO - 'tscrollx', 04:07:29 INFO - 'cart']}, 04:07:29 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['tsvgx', 04:07:29 INFO - 'tsvgr_opacity', 04:07:29 INFO - 'tart', 04:07:29 INFO - 'tscrollx', 04:07:29 INFO - 'cart']}, 04:07:29 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:07:29 INFO - 'tests': ['tp5o']}, 04:07:29 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:07:29 INFO - 'talos_options': ['--e10s'], 04:07:29 INFO - 'tests': ['tp5o']}, 04:07:29 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:07:29 INFO - 'talos_options': ['--xperf_path', 04:07:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:07:29 INFO - 'tests': ['tp5n']}, 04:07:29 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:07:29 INFO - 'talos_options': ['--e10s', 04:07:29 INFO - '--xperf_path', 04:07:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:07:29 INFO - 'tests': ['tp5n']}}, 04:07:29 INFO - 'talos.zip': {'path': '', 04:07:29 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:07:29 INFO - Running post-action listener: _resource_record_post_action 04:07:29 INFO - ##### 04:07:29 INFO - ##### Running create-virtualenv step. 04:07:29 INFO - ##### 04:07:29 INFO - Running pre-action listener: _resource_record_pre_action 04:07:29 INFO - Running main action method: create_virtualenv 04:07:29 INFO - Creating virtualenv /builds/slave/test/build/venv 04:07:29 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 04:07:29 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:07:29 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:07:29 INFO - Using real prefix '/tools/python27' 04:07:29 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:07:30 INFO - Installing distribute.............................................................................................................................................................................................done. 04:07:33 INFO - Installing pip.................done. 04:07:33 INFO - Return code: 0 04:07:33 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:07:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:33 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 04:07:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 04:07:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:33 INFO - 'HOME': '/Users/cltbld', 04:07:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:33 INFO - 'LOGNAME': 'cltbld', 04:07:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:33 INFO - 'MOZ_NO_REMOTE': '1', 04:07:33 INFO - 'NO_EM_RESTART': '1', 04:07:33 INFO - 'PAGER': '/bin/cat', 04:07:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:33 INFO - 'PWD': '/builds/slave/test', 04:07:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:33 INFO - 'SHELL': '/bin/bash', 04:07:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:33 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:33 INFO - 'USER': 'cltbld', 04:07:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:33 INFO - 'XPC_FLAGS': '0x0', 04:07:33 INFO - 'XPC_SERVICE_NAME': '0', 04:07:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:33 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 04:07:33 INFO - Cleaning up... 04:07:33 INFO - Return code: 0 04:07:33 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:07:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:33 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 04:07:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 04:07:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:33 INFO - 'HOME': '/Users/cltbld', 04:07:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:33 INFO - 'LOGNAME': 'cltbld', 04:07:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:33 INFO - 'MOZ_NO_REMOTE': '1', 04:07:33 INFO - 'NO_EM_RESTART': '1', 04:07:33 INFO - 'PAGER': '/bin/cat', 04:07:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:33 INFO - 'PWD': '/builds/slave/test', 04:07:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:33 INFO - 'SHELL': '/bin/bash', 04:07:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:33 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:33 INFO - 'USER': 'cltbld', 04:07:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:33 INFO - 'XPC_FLAGS': '0x0', 04:07:33 INFO - 'XPC_SERVICE_NAME': '0', 04:07:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:33 INFO - Downloading/unpacking psutil>=0.7.1 04:07: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 04:07: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 04:07: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 04:07: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 04:07: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 04:07: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 04:07:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:07:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:07:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:07:36 INFO - Installing collected packages: psutil 04:07:36 INFO - Running setup.py install for psutil 04:07:36 INFO - building 'psutil._psutil_osx' extension 04:07:36 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 04:07:37 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 04:07:37 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 04:07:37 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 04:07:37 INFO - building 'psutil._psutil_posix' extension 04:07:37 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 04:07:37 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 04:07:37 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 04:07:37 INFO - ^ 04:07:37 INFO - 1 warning generated. 04:07:37 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 04:07:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:07:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:07:38 INFO - Successfully installed psutil 04:07:38 INFO - Cleaning up... 04:07:38 INFO - Return code: 0 04:07:38 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:07:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 04:07:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 04:07:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:38 INFO - 'HOME': '/Users/cltbld', 04:07:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:38 INFO - 'LOGNAME': 'cltbld', 04:07:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:38 INFO - 'MOZ_NO_REMOTE': '1', 04:07:38 INFO - 'NO_EM_RESTART': '1', 04:07:38 INFO - 'PAGER': '/bin/cat', 04:07:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:38 INFO - 'PWD': '/builds/slave/test', 04:07:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:38 INFO - 'SHELL': '/bin/bash', 04:07:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:38 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:38 INFO - 'USER': 'cltbld', 04:07:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:38 INFO - 'XPC_FLAGS': '0x0', 04:07:38 INFO - 'XPC_SERVICE_NAME': '0', 04:07:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:38 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:07:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:40 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:07:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:07:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 04:07:40 INFO - Installing collected packages: mozsystemmonitor 04:07:40 INFO - Running setup.py install for mozsystemmonitor 04:07:40 INFO - Successfully installed mozsystemmonitor 04:07:40 INFO - Cleaning up... 04:07:41 INFO - Return code: 0 04:07:41 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:07:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:41 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:07:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 04:07:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:41 INFO - 'HOME': '/Users/cltbld', 04:07:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:41 INFO - 'LOGNAME': 'cltbld', 04:07:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:41 INFO - 'MOZ_NO_REMOTE': '1', 04:07:41 INFO - 'NO_EM_RESTART': '1', 04:07:41 INFO - 'PAGER': '/bin/cat', 04:07:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:41 INFO - 'PWD': '/builds/slave/test', 04:07:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:41 INFO - 'SHELL': '/bin/bash', 04:07:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:41 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:41 INFO - 'USER': 'cltbld', 04:07:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:41 INFO - 'XPC_FLAGS': '0x0', 04:07:41 INFO - 'XPC_SERVICE_NAME': '0', 04:07:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:41 INFO - Downloading/unpacking blobuploader==1.2.4 04:07:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:43 INFO - Downloading blobuploader-1.2.4.tar.gz 04:07:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:07:43 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:07:43 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 04:07:43 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 04:07:43 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 04:07:43 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 04:07:43 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 04:07:43 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 04:07:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:07:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:07:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:44 INFO - Downloading docopt-0.6.1.tar.gz 04:07:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:07:44 INFO - Installing collected packages: blobuploader, requests, docopt 04:07:44 INFO - Running setup.py install for blobuploader 04:07:45 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:07:45 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:07:45 INFO - Running setup.py install for requests 04:07:45 INFO - Running setup.py install for docopt 04:07:45 INFO - Successfully installed blobuploader requests docopt 04:07:45 INFO - Cleaning up... 04:07:45 INFO - Return code: 0 04:07:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:07:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:45 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 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:45 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 04:07:45 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 04:07:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:45 INFO - 'HOME': '/Users/cltbld', 04:07:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:45 INFO - 'LOGNAME': 'cltbld', 04:07:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:45 INFO - 'MOZ_NO_REMOTE': '1', 04:07:45 INFO - 'NO_EM_RESTART': '1', 04:07:45 INFO - 'PAGER': '/bin/cat', 04:07:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:45 INFO - 'PWD': '/builds/slave/test', 04:07:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:45 INFO - 'SHELL': '/bin/bash', 04:07:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:45 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:45 INFO - 'USER': 'cltbld', 04:07:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:45 INFO - 'XPC_FLAGS': '0x0', 04:07:45 INFO - 'XPC_SERVICE_NAME': '0', 04:07:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-HmAoke-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-26s7Ua-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-dmxgET-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-Cez0Wy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-hFCIhH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-oIQUsC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-Af5QUp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-uK_r3K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:07:46 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-BII7E0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:07:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:07:47 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-KK9wW1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:07:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:07:47 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-8XwkTl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:07:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:07:47 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-HCM9xB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:07:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:07:47 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-p6mmC2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:07:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:07:47 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-ZHkLk2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:07:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:07:47 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-XUKBWL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:07:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:07:47 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-9vIgOT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:07:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:07:47 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-aHtYvL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:07:47 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:07:47 INFO - Running setup.py install for manifestparser 04:07:47 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:07:47 INFO - Running setup.py install for mozcrash 04:07:48 INFO - Running setup.py install for mozdebug 04:07:48 INFO - Running setup.py install for mozdevice 04:07:48 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:07:48 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:07:48 INFO - Running setup.py install for mozfile 04:07:48 INFO - Running setup.py install for mozhttpd 04:07:48 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:07:48 INFO - Running setup.py install for mozinfo 04:07:48 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:07:48 INFO - Running setup.py install for mozInstall 04:07:49 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Running setup.py install for mozleak 04:07:49 INFO - Running setup.py install for mozlog 04:07:49 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Running setup.py install for moznetwork 04:07:49 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Running setup.py install for mozprocess 04:07:49 INFO - Running setup.py install for mozprofile 04:07:49 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:07:49 INFO - Running setup.py install for mozrunner 04:07:49 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:07:50 INFO - Running setup.py install for mozscreenshot 04:07:50 INFO - Running setup.py install for moztest 04:07:50 INFO - Running setup.py install for mozversion 04:07:50 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:07:50 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:07:50 INFO - Cleaning up... 04:07:50 INFO - Return code: 0 04:07:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:07:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:50 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 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:50 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 04:07:50 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 04:07:50 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:50 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:50 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:50 INFO - 'HOME': '/Users/cltbld', 04:07:50 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:50 INFO - 'LOGNAME': 'cltbld', 04:07:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:50 INFO - 'MOZ_NO_REMOTE': '1', 04:07:50 INFO - 'NO_EM_RESTART': '1', 04:07:50 INFO - 'PAGER': '/bin/cat', 04:07:50 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:50 INFO - 'PWD': '/builds/slave/test', 04:07:50 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:50 INFO - 'SHELL': '/bin/bash', 04:07:50 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:50 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:50 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:50 INFO - 'USER': 'cltbld', 04:07:50 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:50 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:50 INFO - 'XPC_FLAGS': '0x0', 04:07:50 INFO - 'XPC_SERVICE_NAME': '0', 04:07:50 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:07:50 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-IDml5w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:07:50 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)) 04:07:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:07:50 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-pqcxSf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:07:50 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)) 04:07:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:07:50 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-PR8QsT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-cMqUAI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-bpQ5bJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-DVobXD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-yTR7LQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-alstr9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-r61Qvb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-5CnA8z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-amUCge-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-I56WTB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:07:51 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)) 04:07:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:07:51 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-IZ52Cs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:07:52 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)) 04:07:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:07:52 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-KxNKYi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:07:52 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)) 04:07:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:07:52 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-07fDnE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:07:52 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)) 04:07:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:07:52 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-o6tqIX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:07:52 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)) 04:07:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:07:52 INFO - Running setup.py (path:/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/pip-s_Dh3Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:07:52 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)) 04:07:52 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)) 04:07:52 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)) 04:07:52 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)) 04:07:52 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)) 04:07:52 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)) 04:07:52 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:07:52 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 04:07:52 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 04:07:52 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 04:07:52 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 04:07:52 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 04:07:52 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 04:07:54 INFO - Downloading blessings-1.6.tar.gz 04:07:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:07:55 INFO - Installing collected packages: blessings 04:07:55 INFO - Running setup.py install for blessings 04:07:55 INFO - Successfully installed blessings 04:07:55 INFO - Cleaning up... 04:07:55 INFO - Return code: 0 04:07:55 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:07:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:07:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:07:55 INFO - Reading from file tmpfile_stdout 04:07:55 INFO - Current package versions: 04:07:55 INFO - blessings == 1.6 04:07:55 INFO - blobuploader == 1.2.4 04:07:55 INFO - docopt == 0.6.1 04:07:55 INFO - manifestparser == 1.1 04:07:55 INFO - mozInstall == 1.12 04:07:55 INFO - mozcrash == 0.17 04:07:55 INFO - mozdebug == 0.1 04:07:55 INFO - mozdevice == 0.48 04:07:55 INFO - mozfile == 1.2 04:07:55 INFO - mozhttpd == 0.7 04:07:55 INFO - mozinfo == 0.9 04:07:55 INFO - mozleak == 0.1 04:07:55 INFO - mozlog == 3.1 04:07:55 INFO - moznetwork == 0.27 04:07:55 INFO - mozprocess == 0.22 04:07:55 INFO - mozprofile == 0.28 04:07:55 INFO - mozrunner == 6.11 04:07:55 INFO - mozscreenshot == 0.1 04:07:55 INFO - mozsystemmonitor == 0.0 04:07:55 INFO - moztest == 0.7 04:07:55 INFO - mozversion == 1.4 04:07:55 INFO - psutil == 3.1.1 04:07:55 INFO - requests == 1.2.3 04:07:55 INFO - wsgiref == 0.1.2 04:07:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:07:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:55 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 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:55 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 04:07:55 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 04:07:55 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:55 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:55 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:55 INFO - 'HOME': '/Users/cltbld', 04:07:55 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:55 INFO - 'LOGNAME': 'cltbld', 04:07:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:55 INFO - 'MOZ_NO_REMOTE': '1', 04:07:55 INFO - 'NO_EM_RESTART': '1', 04:07:55 INFO - 'PAGER': '/bin/cat', 04:07:55 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:55 INFO - 'PWD': '/builds/slave/test', 04:07:55 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:55 INFO - 'SHELL': '/bin/bash', 04:07:55 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:55 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:55 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:55 INFO - 'USER': 'cltbld', 04:07:55 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:55 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:55 INFO - 'XPC_FLAGS': '0x0', 04:07:55 INFO - 'XPC_SERVICE_NAME': '0', 04:07:55 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 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)) 04:07:55 INFO - Cleaning up... 04:07:55 INFO - Return code: 0 04:07:55 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:07:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:07:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:55 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 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:55 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 04:07:55 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 04:07:55 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:55 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:55 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:55 INFO - 'HOME': '/Users/cltbld', 04:07:55 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:55 INFO - 'LOGNAME': 'cltbld', 04:07:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:55 INFO - 'MOZ_NO_REMOTE': '1', 04:07:55 INFO - 'NO_EM_RESTART': '1', 04:07:55 INFO - 'PAGER': '/bin/cat', 04:07:55 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:55 INFO - 'PWD': '/builds/slave/test', 04:07:55 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:55 INFO - 'SHELL': '/bin/bash', 04:07:55 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:55 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:55 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:55 INFO - 'USER': 'cltbld', 04:07:55 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:55 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:55 INFO - 'XPC_FLAGS': '0x0', 04:07:55 INFO - 'XPC_SERVICE_NAME': '0', 04:07:55 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:56 INFO - Downloading/unpacking jsonschema 04:07:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:58 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:07:58 INFO - Downloading/unpacking functools32 (from jsonschema) 04:07:58 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 04:07:58 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 04:07:58 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 04:07:58 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 04:07:58 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 04:07:58 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 04:07:58 INFO - Downloading functools32-3.2.3-2.tar.gz 04:07:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:07:59 INFO - warning: no files found matching '*.txt' 04:07:59 INFO - no previously-included directories found matching 'build' 04:07:59 INFO - no previously-included directories found matching 'dist' 04:07:59 INFO - no previously-included directories found matching '.git*' 04:07:59 INFO - Installing collected packages: jsonschema, functools32 04:07:59 INFO - Running setup.py install for functools32 04:07:59 INFO - warning: no files found matching '*.txt' 04:07:59 INFO - no previously-included directories found matching 'build' 04:07:59 INFO - no previously-included directories found matching 'dist' 04:07:59 INFO - no previously-included directories found matching '.git*' 04:07:59 INFO - Successfully installed jsonschema functools32 04:07:59 INFO - Cleaning up... 04:07:59 INFO - Return code: 0 04:07:59 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:07: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')]} 04:07:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07: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')]} 04:07:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10454da30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10455d420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f86685a44a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, '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.rQEvGItJvk/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.bVHnKYuLCR/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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 04:07:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 04:07:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 04:07:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:07:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:07:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:07:59 INFO - 'HOME': '/Users/cltbld', 04:07:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:07:59 INFO - 'LOGNAME': 'cltbld', 04:07:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:59 INFO - 'MOZ_NO_REMOTE': '1', 04:07:59 INFO - 'NO_EM_RESTART': '1', 04:07:59 INFO - 'PAGER': '/bin/cat', 04:07:59 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:07:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:59 INFO - 'PWD': '/builds/slave/test', 04:07:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:07:59 INFO - 'SHELL': '/bin/bash', 04:07:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:07:59 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:07:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:07:59 INFO - 'USER': 'cltbld', 04:07:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:07:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:07:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:59 INFO - 'XPC_FLAGS': '0x0', 04:07:59 INFO - 'XPC_SERVICE_NAME': '0', 04:07:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:07:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:59 INFO - Downloading/unpacking flake8 04:07:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:08:02 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:08:02 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:08:02 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 04:08:02 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 04:08:02 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 04:08:02 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 04:08:02 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 04:08:02 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 04:08:02 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:08:02 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:08:02 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 04:08:02 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 04:08:02 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 04:08:02 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 04:08:02 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 04:08:02 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 04:08:03 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:08:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:08:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:08:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:08:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:08:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:08:03 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:08:03 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:08:03 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:08:03 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:08:03 INFO - no previously-included directories found matching 'docs/_build' 04:08:03 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:08:03 INFO - Running setup.py install for pep8 04:08:03 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:08:03 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:08:03 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:08:03 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:08:03 INFO - no previously-included directories found matching 'docs/_build' 04:08:03 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:08:03 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:08:03 INFO - Cleaning up... 04:08:04 INFO - Return code: 0 04:08:04 INFO - Running post-action listener: _resource_record_post_action 04:08:04 INFO - Running post-action listener: _start_resource_monitoring 04:08:04 INFO - Starting resource monitoring. 04:08:04 INFO - ##### 04:08:04 INFO - ##### Running install step. 04:08:04 INFO - ##### 04:08:04 INFO - Running pre-action listener: _resource_record_pre_action 04:08:04 INFO - Running main action method: install 04:08:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:08:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:08:04 INFO - Reading from file tmpfile_stdout 04:08:04 INFO - Detecting whether we're running mozinstall >=1.0... 04:08:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:08:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:08:04 INFO - Reading from file tmpfile_stdout 04:08:04 INFO - Output received: 04:08:04 INFO - Usage: mozinstall [options] installer 04:08:04 INFO - Options: 04:08:04 INFO - -h, --help show this help message and exit 04:08:04 INFO - -d DEST, --destination=DEST 04:08:04 INFO - Directory to install application into. [default: 04:08:04 INFO - "/builds/slave/test"] 04:08:04 INFO - --app=APP Application being installed. [default: firefox] 04:08:04 INFO - mkdir: /builds/slave/test/build/application 04:08:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 04:08:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 04:08:38 INFO - Reading from file tmpfile_stdout 04:08:38 INFO - Output received: 04:08:38 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 04:08:38 INFO - Running post-action listener: _resource_record_post_action 04:08:38 INFO - ##### 04:08:38 INFO - ##### Running run-tests step. 04:08:38 INFO - ##### 04:08:38 INFO - Running pre-action listener: _resource_record_pre_action 04:08:38 INFO - Running main action method: run_tests 04:08:38 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 04:08:38 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 04:08:38 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 04:08:38 INFO - 2016-04-05 04:08:38.093 screenresolution[1643:7819] starting screenresolution argv=screenresolution get 04:08:38 INFO - 2016-04-05 04:08:38.096 screenresolution[1643:7819] Display 0: 1600x1200x32@60 04:08:38 INFO - 2016-04-05 04:08:38.102 screenresolution[1644:7821] starting screenresolution argv=screenresolution list 04:08:38 INFO - Available Modes on Display 0 04:08:38 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 04:08:38 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 04:08:38 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 04:08:38 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 04:08:38 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 04:08:38 INFO - Intel Iris: 04:08:38 INFO - Chipset Model: Intel Iris 04:08:38 INFO - Type: GPU 04:08:38 INFO - Bus: Built-In 04:08:38 INFO - VRAM (Dynamic, Max): 1536 MB 04:08:38 INFO - Vendor: Intel (0x8086) 04:08:38 INFO - Device ID: 0x0a2e 04:08:38 INFO - Revision ID: 0x0009 04:08:38 INFO - Displays: 04:08:38 INFO - Display: 04:08:38 INFO - Resolution: 1600 x 1200 @ 60 Hz 04:08:38 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 04:08:38 INFO - Display Serial Number: 1600x1200 60 04:08:38 INFO - Main Display: Yes 04:08:38 INFO - Mirror: Off 04:08:38 INFO - Online: Yes 04:08:38 INFO - Rotation: Supported 04:08:38 INFO - Return code: 0 04:08:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:08:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:08:38 INFO - Python 2.7.3 04:08:38 INFO - Return code: 0 04:08:38 INFO - grabbing minidump binary from tooltool 04:08:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 04:08:38 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 0x1043ece00>, '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 0x104255db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1043e7b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:08:38 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 04:08:38 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 04:08:38 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:08:38 INFO - Return code: 0 04:08:38 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 04:08:38 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:08:38 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:08:38 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 04:08:38 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:08:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:08:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:08:39 INFO - Return code: 0 04:08:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0100', '--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 04:08:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0100 --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 04:08:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.rQEvGItJvk/Render', 04:08:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:08:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:08:39 INFO - 'HOME': '/Users/cltbld', 04:08:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:08:39 INFO - 'LOGNAME': 'cltbld', 04:08:39 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:08:39 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 04:08:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:08:39 INFO - 'MOZ_NO_REMOTE': '1', 04:08:39 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:08:39 INFO - 'NO_EM_RESTART': '1', 04:08:39 INFO - 'PAGER': '/bin/cat', 04:08:39 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:08:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:08:39 INFO - 'PWD': '/builds/slave/test', 04:08:39 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:08:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:08:39 INFO - 'SHELL': '/bin/bash', 04:08:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.bVHnKYuLCR/Listeners', 04:08:39 INFO - 'TMPDIR': '/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/', 04:08:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:08:39 INFO - 'USER': 'cltbld', 04:08:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:08:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:08:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:08:39 INFO - 'XPC_FLAGS': '0x0', 04:08:39 INFO - 'XPC_SERVICE_NAME': '0', 04:08:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:08:39 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0100', '--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 04:08:39 INFO - mozversion application_buildid: 20160405020119 04:08:39 INFO - mozversion application_changeset: d9f50aa0a1aaf90499b85c31e0f329b762e80fdd 04:08:39 INFO - mozversion application_display_name: Nightly 04:08:39 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:08:39 INFO - mozversion application_name: Firefox 04:08:39 INFO - mozversion application_remotingname: firefox 04:08:39 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:08:39 INFO - mozversion application_vendor: Mozilla 04:08:39 INFO - mozversion application_version: 48.0a1 04:08:39 INFO - mozversion platform_buildid: 20160405020119 04:08:39 INFO - mozversion platform_changeset: d9f50aa0a1aaf90499b85c31e0f329b762e80fdd 04:08:39 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:08:39 INFO - mozversion platform_version: 48.0a1 04:08:39 INFO - using testdate: 1459854519 04:08:39 INFO - actual date: 1459854519 04:08:39 INFO - starting webserver on 'localhost:49270' 04:08:39 INFO - SUITE-START | Running 2 tests 04:08:39 INFO - TEST-START | dromaeo_css 04:08:39 INFO - operating with platform_type : mac_ 04:08:39 INFO - Initialising browser for dromaeo_css test... 04:08:39 INFO - TEST-INFO | started process 1662 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/tmp_eKc9A/profile http://localhost:49270/getInfo.html) 04:08:42 INFO - PROCESS | 1662 | JavaScript error: jar:file:///builds/slave/test/build/application/Nightly.app/Contents/Resources/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 04:08:42 INFO - PROCESS | 1662 | __metrics Screen width/height:1600/1200 04:08:42 INFO - PROCESS | 1662 | colorDepth:24 04:08:42 INFO - PROCESS | 1662 | Browser inner width/height: 1024/689 04:08:42 INFO - PROCESS | 1662 | __metrics 04:08:42 ERROR - PROCESS | 1662 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 04:08:43 INFO - TEST-INFO | 1662: exit 0 04:08:43 INFO - Browser initialized. 04:08:43 INFO - Running cycle 1/1 for dromaeo_css test... 04:08:43 INFO - TEST-INFO | started process 1664 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/tmp_eKc9A/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:08:55 INFO - PROCESS | 1664 | RSS: Main: 246673408 04:08:55 INFO - PROCESS | 1664 | 04:09:44 INFO - PROCESS | 1664 | 1459854584698 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] 04:11:55 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49270/tests/dromaeo/cssquery-ext.html) 04:11:56 INFO - PROCESS | 1664 | RSS: Main: 257867776 04:11:56 INFO - PROCESS | 1664 | 04:14:58 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-ext.html (next: http://localhost:49270/tests/dromaeo/cssquery-jquery.html) 04:14:59 INFO - PROCESS | 1664 | RSS: Main: 270155776 04:14:59 INFO - PROCESS | 1664 | 04:18:01 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49270/tests/dromaeo/cssquery-mootools.html) 04:18:01 INFO - PROCESS | 1664 | RSS: Main: 271839232 04:18:01 INFO - PROCESS | 1664 | 04:21:03 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49270/tests/dromaeo/cssquery-prototype.html) 04:21:03 INFO - PROCESS | 1664 | RSS: Main: 275402752 04:21:03 INFO - PROCESS | 1664 | 04:24:06 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49270/tests/dromaeo/cssquery-yui.html) 04:24:07 INFO - PROCESS | 1664 | RSS: Main: 275009536 04:24:07 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-yui.html (next: http://localhost:49270/tests/dromaeo/cssquery-dojo.html) 04:27:09 INFO - PROCESS | 1664 | RSS: Main: 279920640 04:27:09 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | __start_tp_report 04:27:09 INFO - PROCESS | 1664 | _x_x_mozilla_page_load 04:27:09 INFO - PROCESS | 1664 | _x_x_mozilla_page_load_details 04:27:09 INFO - PROCESS | 1664 | |i|pagename|runs| 04:27:09 INFO - PROCESS | 1664 | |0;dojo.html;3560.679538841504;3566.661167189116;3613.945790813138;3616.5117709109263;3636.2000359920808;5917;5949.107633854924;5990.071538911465;6008.098785182219;6035;4605.723656580608;5834.920539700159;5855.063189889618;5948.524118070555;6029.306629737582;5281.603879709028;5339.092354299759;5354.9196762048605;5397.217403476494;5408.215808707735;433.37921450841884;5275.709835959021;5395.298611180541;5421.566274698014;5477.643953143053;5338.706371149624;5345;5367.1680889462195;5369.677819330833;5370.462953704638;5265.341832270966;5383.057964856134;5429.782808687648;5435.646682965634;5439;5264.552513036397;5269.894602107936;5358.276632654581;5383.111786555213;5418.862038971821;4865.953819928697;5039.622028347889;5866.911996320058;5946.137810017523;5949.345571987078;6135.44703110649;6189.87620247597;6224;6245.656488893109;6304.590201636879;6262.96868515659;6278.121063051177;6283.088952101965;6297.086922396227;6299.496040316763;5989.970050149765;5992.131140984577;6009.909851352277;6033.5173186145;6089.117078023662;6249;6342.270638876496;6377.5216858735785;6378.107065010902;6430;6209.875802483925;6223.875522489616;6248.50011999039;6250.781222657185;6269.46709529686;6333.20834895638;6358.3641635836975;6359.745610175633;6381.1704478417505;6387;6138.662373569497;6169.753209871555;6234.1583886175695;6261.123442718023;6276.560640755103;6166.383361663888;6238.781642642486;6251.937480625226;6252.874942501125;6287.434130928147;3546.8226588670464;4600.171969045537;5038.949610503848;5049.141645920203;5068.594512438996;3768.4347347897487;4186.748795072244;4457.821687132543;4466.39703640011;4552.226121559343;5914.378990206053;5931.436513531207;5967.403259674084;5984.850378740566;6000.849978750566;6327.335629758901;6340.397662222082;6356.491480681627;6360.395762402564;6368.554201205964;5864.560157988168;5960.970195148997;6043.184170137063;6046.486048685911;6086.817395478142;4583.175028494903;5475.589330800206;5495.340559132929;5498.697571633598;5606.074997625346;6342.49260059185;6557.770478033246;6577.309382514863;6578.407943285031;6586.308437614078;6251.249850018027;6316.431521163117;6364.109024736448;6378.011408231731;6389.329120442287;6541.215054193527;6561.606303621607;6579.243387010555;6579.967100164468;6600.405963463311;6123.404636889863;6174.8147555573405;6241.469475094668;6279.905801413074;6280.905786413116;6353.396427339396;6380.489560835215;6396.264429590657;6410.967945160244;6422.775202867877;6063.636181829104;6174.598651087665;6216.347283535164;6217.751289948533;6228.564000520101;6091.116788065794;6118.253719382578;6123.5876691309595;6217.96891015542;6225.906611400923;5085.237214417719;6030.396960303934;6090.246469782017;6099.451049405575;6154.107654389999;6140.84169297792;6210.968945155245;6212.565120441525;6214.658193799203;6221.844453888689;6045.214122164267;6101.641069425342;6132.509399248139;6196.659183744938;6199.969000154971 04:27:09 INFO - PROCESS | 1664 | |1;ext.html;447.9865604031878;497.4056003076323;518.9636725429219;550.6585916731627;646.1406329581657;30548;36924.815375923085;36988.630113698855;37027.4445883312;37092.81453592735;38077;38292;38552.614473855254;38575.94952529979;38592.80703596485;9217.631294748202;9310.581023853943;9371.34400591959;9469.248189085041;9512.857307140399;9298.907010929872;9418.858717119248;9471.431714097142;9493.477858717803;9531.857022144673;9417.152456278967;9456.38533495324;9485.383450075724;9529.190018848372;9545.761355966122;8095.797605059862;8177;9413.764655883624;9432.056794320582;9483.478408687519;9318.021607731158;9378.155965963027;9399.812003759955;9514.191293740041;9580.377275477142;36893;37198.25603487942;37548;37965;38003;2374.726906405751;2770.8476033818133;2897.7102289771065;3232.983835080833;3324.5844269466315;22014.00936957841;26901.327466813487;27028;27383.45233095327;27444.17667469979;2731.7951153663553;2753.4630747004344;2860.7997440179197;2888.1913064342016;2964.1552157635188;489218.99999999645;492345;499417;500530;504229;66749;67196.328036719;67557;67766;67774.66112669405;67471;68085;69603.65198173976;69682.65158674175;70299.64850175819;16469.91765041167;16636;17074.231659575347;17082.487525374258;17147.74278385825;12651.93674031624;12864.871351286554;12986.935065324613;12994.740105198032;13032.41354139066;21201.575968480545;21383.144674212857;21647.567048658937;21703.891480542497;21706.457338566663;8990.797254672647;9238.538073096453;9261.629534818532;9283.860742088875;9295.72112836616;966.5747071288611;1041.3959903256093;1049.574922156528;1093.0108252031923;1142.6514912951463;24444;27822.026229081886;28999.275018124295;29170.562441563394;29226.853865730962;1072.201210098466;1099.8790133085354;1109.6615532262738;1129.5594718059963;1144.5993902134187;14660.706785864222;14740.705185896437;14769.966102372731;15051.473198438001;15114.773278400833;528263;529191;536265;539648;542999;57156.14265786017;57647.42352576504;57939;58226.70886645625;58492.7075364629;1367.405178747248;1380.6893448974101;1406.156306216262;1456.155429850684;1460.0655580428534;24433.633495497226;28673.856630716713;28708.569371459027;28709.995150169645;29234;49106;49490.010199795084;49540.75229623829;49890.750546247036;49928.50071499384;480575;484447;486229;487417;491918;30322.84838575793;30431.717621178057;31066.844665776527;31195.84402077975;31291.53062704107;38004.80997595105;42739.78630106954;43981.12037759291;44617.77691111524;44997.10005799931;25927.611085834105;33706;36100.38898490417;36546.63453365432;36675.26649467049;35749.28501429905;36047.639523605474;36113;36307.63692363042;36761;35115.19781017874;35702.46446303256;35704.464433033005;36135.819320903225;36594.90215293546;30962;31911.84044079765;32042.679573203968;32080.35839283248;32104.83947580247;22526.098956041576;23824.761752382256;24552.263432097065;24553.263402097964;24827.87586062058 04:27:09 INFO - PROCESS | 1664 | |2;jquery.html;347.5863722170617;357.13395017083565;359.7517712778183;361.2179631098671;364.1024873686363;18978.81021189788;18990.71513927292;19198.23207071717;19976;19993.500162495944;19525;19612.509687257825;19886.50283742907;19921.800781992177;20189.59620807583;5537.141743029827;5815.941840581603;5861.120831875211;5869.383714709958;5877.559183061266;4153.522344930327;5721.113227449731;5991.940080599204;6051.909221361683;6321.968390158043;6195;6263.31103578606;6265.655388953605;6270.996640537515;6271.968640156816;5985.88028239435;6133.723982420802;6161.168242287279;6286.49708023357;6307.4007969243075;5296.364436267672;5299.099153143975;5307.363116426053;5416.8104116356135;5448.237246785453;22379.888100559394;23140;23555.76444235553;23631.645525317133;24363.269101926795;2040.0615716770303;2073.02567793137;2138.6791981202946;2272.7954484096344;2447.9963215081907;9439.622415103388;9565.952170239174;9679.419234845931;10038.397696138181;10122.190224782;1666.5417010322137;1717.652772477914;1752.7195648696147;1769.796473405549;1802.9008404537744;78999;108975.36536951872;110077;112250;113095;10600.310979786289;10941.179411544166;11089.944550277198;11145.832812507819;11416.885831141748;13417.66455838612;13520.18878867271;13520.391582378816;13573.253471059186;13575.253361065235;8224.753257402288;8278.544680042656;8303.211194936472;8331.37514686401;8389.832203356022;6904.861902761917;7386.852262954818;8245.95877020611;8568;8699.478031318142;4231.915361692749;4280.892977675583;4315.3095504719095;4328.264195086843;4369.80335884886;1538.9307481163376;1751.098184435017;1809;1875.559243577758;1904.9428517144509;867.280157469299;872.6509396241554;897;937.4281688170211;987.4026214140486;17580.824191757918;19936.3022294219;20018.59962800736;20146.39560813178;20248.696269555967;939.1735272959752;939.9284815310551;940.8400571902793;948.7628092976756;966.0966995858895;7468.365188958891;10272.691819245285;10720.678379648623;10870.510827012804;10995.725106872233;584544;590952;605697;609907;661949;96825;100680.49659751654;109708;115089;118997.40501297438;996.7308826616918;1002.0830939690247;1004.7387679203459;1009.3893194617298;1019.6788011776415;17786;17832.55418614493;18288.634227315113;18567.721484177477;18573.535661608566;48675.539733808044;50525.74737126291;50760;50843.23735143902;51328.74335628298;71851;71906.92139618014;72138;72239;72353;9266.934302555292;10772.622958196738;10908.400037997986;11077.169212308949;11545.595904143314;12526.311052892179;13066.869331306565;13284.53504127351;13640.317984100953;13670.794938076137;7786.961065194864;9858.112769850748;11246.1565382595;11401.771964560829;11427.257228280136;7650.885236721342;7817.140114587504;7983.3127903669565;8074.152214017444;8129.8374032520205;7990.800229994296;8087.797805054685;8136.123411652674;8342.749717508485;8413.915860841558;11179.217454778413;11345.205835591429;11585.594504192313;11668.766624667629;11735.295882247092;11285.71785705364;11422.086233101165;11432.885671143182;11437.370944598128;11770.3526306054 04:27:09 INFO - PROCESS | 1664 | |3;mootools.html;1575.5194665626982;1591.5225432370287;1851.5926496170846;1947.7565304336958;1968.8523360747947;7851.48965317254;8462.788430289245;8558.144185581446;8763.430377025497;8812;8540.57297135144;8540.743777686665;8557.786055348619;8596.699115530957;8648.783780405493;2418.504206637644;2421.092090466075;2439.9634005489934;2468.222509909373;2469.753024697534;2086.478380404899;2387.7970372518357;2418.854868707874;2431.124795073772;2480.6651102101255;2387.3554140382084;2429.441228517442;2465.8767061646936;2467.1858286765414;2482.5407299649623;2413.505231427553;2431.817613678981;2461.913833015845;2464.839785413951;2479.590867506859;2386.5226954608975;2387.7970372518357;2398.5322862041908;2415.698037745282;2458.729539750626;8555.95722021392;8656.740297791013;8699.565021748951;8702.912970870273;8739.737807865775;5339.519443250126;5346.091164502044;5347.759350829222;5389.461053894618;5510.173473978895;3539.203679172191;3620.0406892173596;3621.2395396966667;3642.307961487309;3681.5398075240596;1052.8772851658537;1053.499587695846;1063.5533076108054;1069.9358038517714;1076.424113099488;11571.94214028933;11862.051035917106;11865.5847045353;11876.287422754576;11899.107566932427;4787.8563643090765;4859.1496488114435;4960.355153830051;4987.301777751118;5002.949970500248;9674.08096230857;9692.22462203022;9758.316917815826;9841;9924;5335.973320133375;5337.172738225581;5357.330333708286;5383.300170977826;5398.379186393615;4448.288273876229;4767.69010014348;4909.705417674951;4923.384576927884;4974.1543937530705;3856.9614303857165;3859.7298189127055;3917.8236979335998;3950.7827069511454;3978.482797236341;1132.3488993828582;1320.854705982341;1333.8266025416633;1334.6996925691642;1337.237774468563;1322.2000689582856;1357.321339330335;1364.733876894016;1379.2069560003038;1394.4422231107435;8042.839143217103;8195.672173113127;8207.835843283101;8211.917880821235;8217;521.0256819747098;522.5636593444441;526.8366806290062;527.2776296473855;527.862755683525;5193.4027586828;6035.577509574376;6223.937760622426;6252.343503932022;6257.937420625826;10059.346142500714;10282.948585257176;10294.227932905062;10373.325733827278;10423.009814067651;9919.454430006419;10054.899451005542;10224;10272.640457583948;10286.485675716185;7950.801229969297;7950.840983180304;8009.879851802228;8028.4781489203015;8118.634661440249;7699.230076992256;7838.451308408356;7873.37013038967;7880.211978802074;7996.24035716606;9087.63649454041;9125.406848554823;9304.488253146143;9402.623895044122;9523.952380238332;7964.20357964199;9369.156775890202;9417.623295068395;9468.14786669203;9594.088561586637;6546.18172728409;6617;7084.468664850054;7295.452841037049;7335.8532829344185;6775.661216939232;7944;7948.085970113511;8104.8784268237205;8138.593070346577;6139.877202456015;6662.966685166737;6902.137232845895;7121.394681452135;7393.001944737392;6704.765333213314;6746;7120.964395177991;7126.679299431435;7320.377767889789;7386.630668466448;7586.696532138652;7611.885821712568;7613.428992825449;7669.118051424158;6751.864962700817;6767.796966091025;6876.965615171892;6924.619145947021;6930.13373328334;6724.092247546519;6882.931170688429;6884.139482564679;6961.79114626562;6964.965175174294 04:27:09 INFO - PROCESS | 1664 | |4;prototype.html;325.34118410219315;325.8338247493778;328.02739876266867;335;336.8770398804437;5753.9999999999945;6573.309802470743;6858.622775747332;6867.896981545275;6872.312768723125;6845.657717114137;6860.245373008977;6867.313268673131;6874.518783685144;6880.621565813878;4772.04559088182;4852.927206091911;5001.274815151801;5005.474425185358;5011.649184557083;4033.7781422021776;5013.523715247045;5015.022070696215;5018.548330650241;5060.367454068241;4952.975235123819;4957.975210123945;4969.031038947407;4974.278729584208;4986.925196122061;4954.207326827708;4958;5001.574866136347;5011.173156429203;5047.293378926953;4315.697901146921;4335.5014173370155;4339.457567804025;4343.284402660963;4347.804348804311;6364;6594.373534514213;6615.569987950767;6692.163479565054;6695.3639404257;5892.793752218695;5929.911051334234;5932.703364831785;5942.554308426886;5976.760929562813;6126.356732543063;7163.817970034938;7308.415326773846;7317.5609463432365;7356.705731770723;4821.37322148122;4840.588549973257;4841.757912104381;4847.612191024745;4880.316755654211;6857.897131542981;7620.542767433972;7664.770056898246;7686.193744470045;7720.922790772077;4761.761911904391;4829.806807727722;4862.927056094161;4881.609471242292;4889.339939108246;4095.89760255996;4947.925781113287;4950.331705219821;4950.603951683856;4966.553010229097;5889.705514724246;5933.525317974638;5948.167256584082;5965.492933100648;5966.76132954677;7341.045664063744;7360.705571777069;7410.184879663233;7416.7033318666645;7427.257274272638;1629.3075442936704;1702.2254874032285;1709.290644382592;1726.6978278801412;1736.426979096895;1006.572206812102;1108.706192858893;1118.6588090632436;1136.6874109619755;1144.547903578082;5794.449527294901;5906.26171728534;6394.648294343856;6742.954841999498;6854.691538880762;6621.470282377399;7570.697172113164;7578.924210757932;7584.317411432998;7618.047744031996;6704.899426508607;6767.154105736783;6769.763058292936;6779.9322006780285;6793.354631310018;3872.9806350968065;3993.281209382339;4040.0505881117915;4047.9392809107885;4060.5330387005283;7142.857142857218;7145.856662933906;7638.961805190938;8079.394045446615;8233.588320583947;6404.5516813823515;7947.960260198662;7991.320737737357;7996.24035716606;8001.239882211181;6115.602485838406;8002.159773223961;8041.155678653774;8057.153998830038;8084.919150808417;7371.152317483558;7677.539347639159;7689.269519395649;7693.88459173124;7752.612369381395;6055.576109672281;7498.025256716592;7499.362554182955;7520.8495830082;7535.246475352421;6465.741370345321;8008.079070906687;8062.475939063942;8081.272685458337;8102.068262149693;4937.407511098691;4952.77712502931;4957.281194226744;4960.280759289955;4975.0547395994645;7363.926360736324;7679.616019199129;7694.307512323918;7701.730439434593;7711.768646940601;7338.486305958745;7372.96313518429;7374.1151061872915;7379.741709040158;7395.667194976131;7364.447666424932;7365;7388.741394051397;7390.852182956418;7413.925860741324;6031.944409728368;7075.681594328371;7130.322619351154;7159.284071592799;7169.598184608006;7076.646167691698;7360.300771426706;7406.407487401103;7436.219196984239;7436.516626419266;7171.103612048494;7192.525532265978;7228.819279518054;7231.059962204879;7237.782866514013 04:27:09 INFO - PROCESS | 1664 | |5;yui.html;690.3407246079993;697.5849369625074;724.5362967700669;728.0244472406977;754.9811254718632;14481.782773258383;14848.1091134532;14999.85000149998;15061.246937653115;15091.169985650798;13799.586012419619;13821;13821.37803798829;13826.792598111037;13831.723365532684;733.6845156582681;893.9150780675825;921.6037104045258;923.9122283383068;971.6939164163266;893.8569828827389;909.9853663165555;914.1041779056495;922.727795300388;931.3201363005011;924.2559739409772;939.6241503398627;966.2801213096218;968.5544649461257;970.4953424219402;914.561010714854;956.0726095687207;961.6538046303325;965.2760429677742;966.5988614724881;727.3344889426169;729.3946024799404;730.9488335816495;731.1263040666406;731.6926890705917;11636.360000199986;14119.929400353036;14156.150630962175;14201;14722.55832325032;12860.421281042376;12861.228326300452;13023;13111.47554097835;13180.275084870329;9945.90054099457;9964.950175249078;10047;10106.49467526628;10110.393376397366;3413.6415676354122;3476.2526056897887;3486.1633208030144;3540.7875527468436;3723.385641369171;71132;72979.63510182415;73057.9041314386;73275;73360.63319683421;9197.678081267257;9367.953160234292;9389.436633801994;9404.670836520689;9453.43279403238;20755.792442075384;21202.469938251357;21244;21556.676649850266;21917.452063698216;7405.555666660018;7419.332260096618;7434.929406073405;7590.316871481593;7661.693532258759;3946.1515774108702;4089.1821635672986;4097;4100.774457404812;4108.404281379183;3438.6045604755773;3465.358908601917;3530.382183117944;3546.255286389887;3576.4277715565904;629.2134831460675;632.9968350158312;633.7908490198223;634.9015902535023;653.095462784038;550.2241839006981;606.5966132521912;612.908063790435;613.6962203709103;641.2977789320686;7751.435312426706;8112.269895709414;8240.340772738167;8272.420930534925;8303.418760686694;544.8583368324264;565.6210339072832;589.5725598940734;617.2777849915609;633.8700566383881;3526.9470957935137;3537.656914216041;3774.1319496515957;3818.904527386782;3891.377379619304;82538;83599;83696;83793.16206837975;84239.57880210559;79562.40875182464;79957.40511138701;82675.58662206771;82680.58659706663;82811;71212.64393677999;71761.92357114647;71954.28045719476;72290;73269.26730732624;6634.933650663432;7805.765827025199;7809.687612495437;7823.921760782319;7858.292753652198;51199.48800511947;51234.97530049453;51341;52293.477065230385;52309;65452.672736636014;66848.6657566709;70344;71972;72908.63545682238;10424.895751042393;10562.577496900345;10609.575616975235;10687.358758474516;10753.1935104869;11592.826107608562;11715.941420292844;11734.413279335828;11819.881801181878;12293.815592766294;10663.89336106629;11185.32888026721;11281.548738050715;11437.256578322382;11605.767884642091;9755.830068096482;11149.331040137618;11726.510491905628;11855.940720296343;12174.695632608902;10940.234183607072;10971.725706857393;11091.001809837153;11403.258788179073;11702.531898723955;9291.442513448945;9425;9515.714528564155;9537.627010479968;9669.9033009669;7578.886316705364;9454.574544145667;9613.51932403363;9747.805043899225;9770.218382529238 04:27:09 INFO - PROCESS | 1664 | __end_tp_report 04:27:09 INFO - PROCESS | 1664 | __start_cc_report 04:27:09 INFO - PROCESS | 1664 | _x_x_mozilla_cycle_collect,359 04:27:09 INFO - PROCESS | 1664 | __end_cc_report 04:27:09 INFO - PROCESS | 1664 | __startTimestamp1459855629708__endTimestamp 04:27:09 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | ------- Summary: start ------- 04:27:09 INFO - PROCESS | 1664 | Number of tests: 6 04:27:09 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | [#0] dojo.html Cycles:165 Average:5810.91 Median:6101.64 stddev:805.05 (13.2%) stddev-sans-first:787.93 04:27:09 INFO - PROCESS | 1664 | Values: 3560.7 3566.7 3613.9 3616.5 3636.2 5917.0 5949.1 5990.1 6008.1 6035.0 4605.7 5834.9 5855.1 5948.5 6029.3 5281.6 5339.1 5354.9 5397.2 5408.2 433.4 5275.7 5395.3 5421.6 5477.6 5338.7 5345.0 5367.2 5369.7 5370.5 5265.3 5383.1 5429.8 5435.6 5439.0 5264.6 5269.9 5358.3 5383.1 5418.9 4866.0 5039.6 5866.9 5946.1 5949.3 6135.4 6189.9 6224.0 6245.7 6304.6 6263.0 6278.1 6283.1 6297.1 6299.5 5990.0 5992.1 6009.9 6033.5 6089.1 6249.0 6342.3 6377.5 6378.1 6430.0 6209.9 6223.9 6248.5 6250.8 6269.5 6333.2 6358.4 6359.7 6381.2 6387.0 6138.7 6169.8 6234.2 6261.1 6276.6 6166.4 6238.8 6251.9 6252.9 6287.4 3546.8 4600.2 5038.9 5049.1 5068.6 3768.4 4186.7 4457.8 4466.4 4552.2 5914.4 5931.4 5967.4 5984.9 6000.8 6327.3 6340.4 6356.5 6360.4 6368.6 5864.6 5961.0 6043.2 6046.5 6086.8 4583.2 5475.6 5495.3 5498.7 5606.1 6342.5 6557.8 6577.3 6578.4 6586.3 6251.2 6316.4 6364.1 6378.0 6389.3 6541.2 6561.6 6579.2 6580.0 6600.4 6123.4 6174.8 6241.5 6279.9 6280.9 6353.4 6380.5 6396.3 6411.0 6422.8 6063.6 6174.6 6216.3 6217.8 6228.6 6091.1 6118.3 6123.6 6218.0 6225.9 5085.2 6030.4 6090.2 6099.5 6154.1 6140.8 6211.0 6212.6 6214.7 6221.8 6045.2 6101.6 6132.5 6196.7 6200.0 04:27:09 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | [#1] ext.html Cycles:180 Average:64542.70 Median:36908.91 stddev:134896.97 (365.5%) stddev-sans-first:135189.55 04:27:09 INFO - PROCESS | 1664 | Values: 448.0 497.4 519.0 550.7 646.1 30548.0 36924.8 36988.6 37027.4 37092.8 38077.0 38292.0 38552.6 38575.9 38592.8 9217.6 9310.6 9371.3 9469.2 9512.9 9298.9 9418.9 9471.4 9493.5 9531.9 9417.2 9456.4 9485.4 9529.2 9545.8 8095.8 8177.0 9413.8 9432.1 9483.5 9318.0 9378.2 9399.8 9514.2 9580.4 36893.0 37198.3 37548.0 37965.0 38003.0 2374.7 2770.8 2897.7 3233.0 3324.6 22014.0 26901.3 27028.0 27383.5 27444.2 2731.8 2753.5 2860.8 2888.2 2964.2 489219.0 492345.0 499417.0 500530.0 504229.0 66749.0 67196.3 67557.0 67766.0 67774.7 67471.0 68085.0 69603.7 69682.7 70299.6 16469.9 16636.0 17074.2 17082.5 17147.7 12651.9 12864.9 12986.9 12994.7 13032.4 21201.6 21383.1 21647.6 21703.9 21706.5 8990.8 9238.5 9261.6 9283.9 9295.7 966.6 1041.4 1049.6 1093.0 1142.7 24444.0 27822.0 28999.3 29170.6 29226.9 1072.2 1099.9 1109.7 1129.6 1144.6 14660.7 14740.7 14770.0 15051.5 15114.8 528263.0 529191.0 536265.0 539648.0 542999.0 57156.1 57647.4 57939.0 58226.7 58492.7 1367.4 1380.7 1406.2 1456.2 1460.1 24433.6 28673.9 28708.6 28710.0 29234.0 49106.0 49490.0 49540.8 49890.8 49928.5 480575.0 484447.0 486229.0 487417.0 491918.0 30322.8 30431.7 31066.8 31195.8 31291.5 38004.8 42739.8 43981.1 44617.8 44997.1 25927.6 33706.0 36100.4 36546.6 36675.3 35749.3 36047.6 36113.0 36307.6 36761.0 35115.2 35702.5 35704.5 36135.8 36594.9 30962.0 31911.8 32042.7 32080.4 32104.8 22526.1 23824.8 24552.3 24553.3 24827.9 04:27:09 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | [#2] jquery.html Cycles:180 Average:33973.80 Median:352.36 stddev:101161.57 (28709.7%) stddev-sans-first:101413.85 04:27:09 INFO - PROCESS | 1664 | Values: 347.6 357.1 359.8 361.2 364.1 18978.8 18990.7 19198.2 19976.0 19993.5 19525.0 19612.5 19886.5 19921.8 20189.6 5537.1 5815.9 5861.1 5869.4 5877.6 4153.5 5721.1 5991.9 6051.9 6322.0 6195.0 6263.3 6265.7 6271.0 6272.0 5985.9 6133.7 6161.2 6286.5 6307.4 5296.4 5299.1 5307.4 5416.8 5448.2 22379.9 23140.0 23555.8 23631.6 24363.3 2040.1 2073.0 2138.7 2272.8 2448.0 9439.6 9566.0 9679.4 10038.4 10122.2 1666.5 1717.7 1752.7 1769.8 1802.9 78999.0 108975.4 110077.0 112250.0 113095.0 10600.3 10941.2 11089.9 11145.8 11416.9 13417.7 13520.2 13520.4 13573.3 13575.3 8224.8 8278.5 8303.2 8331.4 8389.8 6904.9 7386.9 8246.0 8568.0 8699.5 4231.9 4280.9 4315.3 4328.3 4369.8 1538.9 1751.1 1809.0 1875.6 1904.9 867.3 872.7 897.0 937.4 987.4 17580.8 19936.3 20018.6 20146.4 20248.7 939.2 939.9 940.8 948.8 966.1 7468.4 10272.7 10720.7 10870.5 10995.7 584544.0 590952.0 605697.0 609907.0 661949.0 96825.0 100680.5 109708.0 115089.0 118997.4 996.7 1002.1 1004.7 1009.4 1019.7 17786.0 17832.6 18288.6 18567.7 18573.5 48675.5 50525.7 50760.0 50843.2 51328.7 71851.0 71906.9 72138.0 72239.0 72353.0 9266.9 10772.6 10908.4 11077.2 11545.6 12526.3 13066.9 13284.5 13640.3 13670.8 7787.0 9858.1 11246.2 11401.8 11427.3 7650.9 7817.1 7983.3 8074.2 8129.8 7990.8 8087.8 8136.1 8342.7 8413.9 11179.2 11345.2 11585.6 11668.8 11735.3 11285.7 11422.1 11432.9 11437.4 11770.4 04:27:09 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | [#3] mootools.html Cycles:180 Average:5897.73 Median:5370.32 stddev:3085.54 (57.5%) stddev-sans-first:3077.09 04:27:09 INFO - PROCESS | 1664 | Values: 1575.5 1591.5 1851.6 1947.8 1968.9 7851.5 8462.8 8558.1 8763.4 8812.0 8540.6 8540.7 8557.8 8596.7 8648.8 2418.5 2421.1 2440.0 2468.2 2469.8 2086.5 2387.8 2418.9 2431.1 2480.7 2387.4 2429.4 2465.9 2467.2 2482.5 2413.5 2431.8 2461.9 2464.8 2479.6 2386.5 2387.8 2398.5 2415.7 2458.7 8556.0 8656.7 8699.6 8702.9 8739.7 5339.5 5346.1 5347.8 5389.5 5510.2 3539.2 3620.0 3621.2 3642.3 3681.5 1052.9 1053.5 1063.6 1069.9 1076.4 11571.9 11862.1 11865.6 11876.3 11899.1 4787.9 4859.1 4960.4 4987.3 5002.9 9674.1 9692.2 9758.3 9841.0 9924.0 5336.0 5337.2 5357.3 5383.3 5398.4 4448.3 4767.7 4909.7 4923.4 4974.2 3857.0 3859.7 3917.8 3950.8 3978.5 1132.3 1320.9 1333.8 1334.7 1337.2 1322.2 1357.3 1364.7 1379.2 1394.4 8042.8 8195.7 8207.8 8211.9 8217.0 521.0 522.6 526.8 527.3 527.9 5193.4 6035.6 6223.9 6252.3 6257.9 10059.3 10282.9 10294.2 10373.3 10423.0 9919.5 10054.9 10224.0 10272.6 10286.5 7950.8 7950.8 8009.9 8028.5 8118.6 7699.2 7838.5 7873.4 7880.2 7996.2 9087.6 9125.4 9304.5 9402.6 9524.0 7964.2 9369.2 9417.6 9468.1 9594.1 6546.2 6617.0 7084.5 7295.5 7335.9 6775.7 7944.0 7948.1 8104.9 8138.6 6139.9 6663.0 6902.1 7121.4 7393.0 6704.8 6746.0 7121.0 7126.7 7320.4 7386.6 7586.7 7611.9 7613.4 7669.1 6751.9 6767.8 6877.0 6924.6 6930.1 6724.1 6882.9 6884.1 6961.8 6965.0 04:27:09 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | [#4] prototype.html Cycles:180 Average:5956.37 Median:6693.76 stddev:1905.25 (28.5%) stddev-sans-first:1863.12 04:27:09 INFO - PROCESS | 1664 | Values: 325.3 325.8 328.0 335.0 336.9 5754.0 6573.3 6858.6 6867.9 6872.3 6845.7 6860.2 6867.3 6874.5 6880.6 4772.0 4852.9 5001.3 5005.5 5011.6 4033.8 5013.5 5015.0 5018.5 5060.4 4953.0 4958.0 4969.0 4974.3 4986.9 4954.2 4958.0 5001.6 5011.2 5047.3 4315.7 4335.5 4339.5 4343.3 4347.8 6364.0 6594.4 6615.6 6692.2 6695.4 5892.8 5929.9 5932.7 5942.6 5976.8 6126.4 7163.8 7308.4 7317.6 7356.7 4821.4 4840.6 4841.8 4847.6 4880.3 6857.9 7620.5 7664.8 7686.2 7720.9 4761.8 4829.8 4862.9 4881.6 4889.3 4095.9 4947.9 4950.3 4950.6 4966.6 5889.7 5933.5 5948.2 5965.5 5966.8 7341.0 7360.7 7410.2 7416.7 7427.3 1629.3 1702.2 1709.3 1726.7 1736.4 1006.6 1108.7 1118.7 1136.7 1144.5 5794.4 5906.3 6394.6 6743.0 6854.7 6621.5 7570.7 7578.9 7584.3 7618.0 6704.9 6767.2 6769.8 6779.9 6793.4 3873.0 3993.3 4040.1 4047.9 4060.5 7142.9 7145.9 7639.0 8079.4 8233.6 6404.6 7948.0 7991.3 7996.2 8001.2 6115.6 8002.2 8041.2 8057.2 8084.9 7371.2 7677.5 7689.3 7693.9 7752.6 6055.6 7498.0 7499.4 7520.8 7535.2 6465.7 8008.1 8062.5 8081.3 8102.1 4937.4 4952.8 4957.3 4960.3 4975.1 7363.9 7679.6 7694.3 7701.7 7711.8 7338.5 7373.0 7374.1 7379.7 7395.7 7364.4 7365.0 7388.7 7390.9 7413.9 6031.9 7075.7 7130.3 7159.3 7169.6 7076.6 7360.3 7406.4 7436.2 7436.5 7171.1 7192.5 7228.8 7231.1 7237.8 04:27:09 INFO - PROCESS | 1664 | 04:27:09 INFO - PROCESS | 1664 | [#5] yui.html Cycles:180 Average:17982.12 Median:647.20 stddev:25050.50 (3870.6%) stddev-sans-first:25087.12 04:27:09 INFO - PROCESS | 1664 | Values: 690.3 697.6 724.5 728.0 755.0 14481.8 14848.1 14999.9 15061.2 15091.2 13799.6 13821.0 13821.4 13826.8 13831.7 733.7 893.9 921.6 923.9 971.7 893.9 910.0 914.1 922.7 931.3 924.3 939.6 966.3 968.6 970.5 914.6 956.1 961.7 965.3 966.6 727.3 729.4 730.9 731.1 731.7 11636.4 14119.9 14156.2 14201.0 14722.6 12860.4 12861.2 13023.0 13111.5 13180.3 9945.9 9965.0 10047.0 10106.5 10110.4 3413.6 3476.3 3486.2 3540.8 3723.4 71132.0 72979.6 73057.9 73275.0 73360.6 9197.7 9368.0 9389.4 9404.7 9453.4 20755.8 21202.5 21244.0 21556.7 21917.5 7405.6 7419.3 7434.9 7590.3 7661.7 3946.2 4089.2 4097.0 4100.8 4108.4 3438.6 3465.4 3530.4 3546.3 3576.4 629.2 633.0 633.8 634.9 653.1 550.2 606.6 612.9 613.7 641.3 7751.4 8112.3 8240.3 8272.4 8303.4 544.9 565.6 589.6 617.3 633.9 3526.9 3537.7 3774.1 3818.9 3891.4 82538.0 83599.0 83696.0 83793.2 84239.6 79562.4 79957.4 82675.6 82680.6 82811.0 71212.6 71761.9 71954.3 72290.0 73269.3 6634.9 7805.8 7809.7 7823.9 7858.3 51199.5 51235.0 51341.0 52293.5 52309.0 65452.7 66848.7 70344.0 71972.0 72908.6 10424.9 10562.6 10609.6 10687.4 10753.2 11592.8 11715.9 11734.4 11819.9 12293.8 10663.9 11185.3 11281.5 11437.3 11605.8 9755.8 11149.3 11726.5 11855.9 12174.7 10940.2 10971.7 11091.0 11403.3 11702.5 9291.4 9425.0 9515.7 9537.6 9669.9 7578.9 9454.6 9613.5 9747.8 9770.2 04:27:09 INFO - PROCESS | 1664 | -------- Summary: end -------- 04:27:09 INFO - PROCESS | 1664 | 04:27:10 INFO - TEST-INFO | 1664: exit 0 04:27:10 INFO - TEST-OK | dromaeo_css | took 1110285ms 04:27:10 INFO - TEST-START | kraken 04:27:10 INFO - operating with platform_type : mac_ 04:27:10 INFO - Initialising browser for kraken test... 04:27:10 INFO - TEST-INFO | started process 1675 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/tmpE7PWXf/profile http://localhost:49270/getInfo.html) 04:27:12 INFO - PROCESS | 1675 | JavaScript error: jar:file:///builds/slave/test/build/application/Nightly.app/Contents/Resources/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 04:27:13 INFO - PROCESS | 1675 | __metrics Screen width/height:1600/1200 04:27:13 INFO - PROCESS | 1675 | colorDepth:24 04:27:13 INFO - PROCESS | 1675 | Browser inner width/height: 1024/689 04:27:13 INFO - PROCESS | 1675 | __metrics 04:27:13 ERROR - PROCESS | 1675 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 04:27:13 INFO - TEST-INFO | 1675: exit 0 04:27:13 INFO - Browser initialized. 04:27:13 INFO - Running cycle 1/1 for kraken test... 04:27:13 INFO - TEST-INFO | started process 1678 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/T/tmpE7PWXf/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:27:25 INFO - PROCESS | 1678 | RSS: Main: 246624256 04:27:25 INFO - PROCESS | 1678 | 04:27:28 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-beat-detection) 04:27:28 INFO - PROCESS | 1678 | RSS: Main: 258744320 04:27:28 INFO - PROCESS | 1678 | 04:27:31 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-dft) 04:27:32 INFO - PROCESS | 1678 | RSS: Main: 268288000 04:27:32 INFO - PROCESS | 1678 | 04:27:35 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-fft) 04:27:36 INFO - PROCESS | 1678 | RSS: Main: 271392768 04:27:36 INFO - PROCESS | 1678 | 04:27:38 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-oscillator) 04:27:38 INFO - PROCESS | 1678 | RSS: Main: 273199104 04:27:38 INFO - PROCESS | 1678 | 04:27:40 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:27:41 INFO - PROCESS | 1678 | RSS: Main: 273616896 04:27:41 INFO - PROCESS | 1678 | 04:27:44 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-darkroom) 04:27:44 INFO - PROCESS | 1678 | RSS: Main: 274329600 04:27:44 INFO - PROCESS | 1678 | 04:27:48 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-desaturate) 04:27:48 INFO - PROCESS | 1678 | RSS: Main: 274149376 04:27:48 INFO - PROCESS | 1678 | 04:27:51 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49270/tests/kraken/driver.html?testName=json-parse-financial) 04:27:52 INFO - PROCESS | 1678 | RSS: Main: 274386944 04:27:52 INFO - PROCESS | 1678 | 04:27:53 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49270/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:27:54 INFO - PROCESS | 1678 | RSS: Main: 273625088 04:27:54 INFO - PROCESS | 1678 | 04:27:56 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:27:56 INFO - PROCESS | 1678 | RSS: Main: 273862656 04:27:56 INFO - PROCESS | 1678 | 04:27:58 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:27:59 INFO - PROCESS | 1678 | RSS: Main: 274735104 04:27:59 INFO - PROCESS | 1678 | 04:28:02 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:28:02 INFO - PROCESS | 1678 | RSS: Main: 274255872 04:28:02 INFO - PROCESS | 1678 | 04:28:05 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:28:05 INFO - PROCESS | 1678 | RSS: Main: 274751488 04:28:05 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49270/tests/kraken/driver.html?testName=ai-astar) 04:28:07 INFO - PROCESS | 1678 | RSS: Main: 275886080 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | __start_tp_report 04:28:07 INFO - PROCESS | 1678 | _x_x_mozilla_page_load 04:28:07 INFO - PROCESS | 1678 | _x_x_mozilla_page_load_details 04:28:07 INFO - PROCESS | 1678 | |i|pagename|runs| 04:28:07 INFO - PROCESS | 1678 | |0;ai-astar;120;155;116;116;116;124;114;115;116;115 04:28:07 INFO - PROCESS | 1678 | |1;audio-beat-detection;150;133;132;182;148;179;164;129;195;151 04:28:07 INFO - PROCESS | 1678 | |2;audio-dft;223;277;203;206;229;196;194;194;229;273 04:28:07 INFO - PROCESS | 1678 | |3;audio-fft;64;81;74;112;59;58;57;62;125;58 04:28:07 INFO - PROCESS | 1678 | |4;audio-oscillator;83;78;123;81;82;87;117;82;80;122 04:28:07 INFO - PROCESS | 1678 | |5;imaging-gaussian-blur;90;95;117;87;99;119;89;94;76;115 04:28:07 INFO - PROCESS | 1678 | |6;imaging-darkroom;152;96;118;130;144;106;96;95;97;95 04:28:07 INFO - PROCESS | 1678 | |7;imaging-desaturate;93;94;91;118;127;92;91;96;92;92 04:28:07 INFO - PROCESS | 1678 | |8;json-parse-financial;57;58;57;57;57;56;58;64;59;56 04:28:07 INFO - PROCESS | 1678 | |9;json-stringify-tinderbox;65;55;73;89;98;98;92;55;85;97 04:28:07 INFO - PROCESS | 1678 | |10;stanford-crypto-aes;87;84;85;85;86;83;85;83;88;85 04:28:07 INFO - PROCESS | 1678 | |11;stanford-crypto-ccm;126;134;136;108;144;133;138;145;123;145 04:28:07 INFO - PROCESS | 1678 | |12;stanford-crypto-pbkdf2;140;142;139;140;144;135;143;138;140;141 04:28:07 INFO - PROCESS | 1678 | |13;stanford-crypto-sha256-iterative;57;97;97;95;96;95;67;66;88;76 04:28:07 INFO - PROCESS | 1678 | __end_tp_report 04:28:07 INFO - PROCESS | 1678 | __start_cc_report 04:28:07 INFO - PROCESS | 1678 | _x_x_mozilla_cycle_collect,980 04:28:07 INFO - PROCESS | 1678 | __end_cc_report 04:28:07 INFO - PROCESS | 1678 | __startTimestamp1459855687953__endTimestamp 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | ------- Summary: start ------- 04:28:07 INFO - PROCESS | 1678 | Number of tests: 14 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#0] ai-astar Cycles:10 Average:120.70 Median:116.00 stddev:12.41 (10.7%) stddev-sans-first:13.16 04:28:07 INFO - PROCESS | 1678 | Values: 120.0 155.0 116.0 116.0 116.0 124.0 114.0 115.0 116.0 115.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#1] audio-beat-detection Cycles:10 Average:156.30 Median:157.50 stddev:22.97 (14.6%) stddev-sans-first:24.25 04:28:07 INFO - PROCESS | 1678 | Values: 150.0 133.0 132.0 182.0 148.0 179.0 164.0 129.0 195.0 151.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#2] audio-dft Cycles:10 Average:222.40 Median:226.00 stddev:30.88 (13.7%) stddev-sans-first:32.76 04:28:07 INFO - PROCESS | 1678 | Values: 223.0 277.0 203.0 206.0 229.0 196.0 194.0 194.0 229.0 273.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#3] audio-fft Cycles:10 Average:75.00 Median:60.50 stddev:24.39 (40.3%) stddev-sans-first:25.54 04:28:07 INFO - PROCESS | 1678 | Values: 64.0 81.0 74.0 112.0 59.0 58.0 57.0 62.0 125.0 58.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#4] audio-oscillator Cycles:10 Average:93.50 Median:81.50 stddev:18.95 (23.2%) stddev-sans-first:19.71 04:28:07 INFO - PROCESS | 1678 | Values: 83.0 78.0 123.0 81.0 82.0 87.0 117.0 82.0 80.0 122.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#5] imaging-gaussian-blur Cycles:10 Average:98.10 Median:89.50 stddev:14.40 (16.1%) stddev-sans-first:14.97 04:28:07 INFO - PROCESS | 1678 | Values: 90.0 95.0 117.0 87.0 99.0 119.0 89.0 94.0 76.0 115.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#6] imaging-darkroom Cycles:10 Average:112.90 Median:95.00 stddev:21.93 (23.1%) stddev-sans-first:18.13 04:28:07 INFO - PROCESS | 1678 | Values: 152.0 96.0 118.0 130.0 144.0 106.0 96.0 95.0 97.0 95.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#7] imaging-desaturate Cycles:10 Average:98.60 Median:92.00 stddev:12.86 (14.0%) stddev-sans-first:13.48 04:28:07 INFO - PROCESS | 1678 | Values: 93.0 94.0 91.0 118.0 127.0 92.0 91.0 96.0 92.0 92.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#8] json-parse-financial Cycles:10 Average:57.90 Median:57.50 stddev:2.33 (4.1%) stddev-sans-first:2.45 04:28:07 INFO - PROCESS | 1678 | Values: 57.0 58.0 57.0 57.0 57.0 56.0 58.0 64.0 59.0 56.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#9] json-stringify-tinderbox Cycles:10 Average:80.70 Median:90.50 stddev:17.34 (19.2%) stddev-sans-first:17.44 04:28:07 INFO - PROCESS | 1678 | Values: 65.0 55.0 73.0 89.0 98.0 98.0 92.0 55.0 85.0 97.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#10] stanford-crypto-aes Cycles:10 Average:85.10 Median:85.00 stddev:1.60 (1.9%) stddev-sans-first:1.54 04:28:07 INFO - PROCESS | 1678 | Values: 87.0 84.0 85.0 85.0 86.0 83.0 85.0 83.0 88.0 85.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#11] stanford-crypto-ccm Cycles:10 Average:133.20 Median:137.00 stddev:11.63 (8.5%) stddev-sans-first:12.04 04:28:07 INFO - PROCESS | 1678 | Values: 126.0 134.0 136.0 108.0 144.0 133.0 138.0 145.0 123.0 145.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:140.20 Median:140.50 stddev:2.57 (1.8%) stddev-sans-first:2.73 04:28:07 INFO - PROCESS | 1678 | Values: 140.0 142.0 139.0 140.0 144.0 135.0 143.0 138.0 140.0 141.0 04:28:07 INFO - PROCESS | 1678 | 04:28:07 INFO - PROCESS | 1678 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:83.40 Median:95.00 stddev:15.43 (16.2%) stddev-sans-first:13.08 04:28:07 INFO - PROCESS | 1678 | Values: 57.0 97.0 97.0 95.0 96.0 95.0 67.0 66.0 88.0 76.0 04:28:07 INFO - PROCESS | 1678 | -------- Summary: end -------- 04:28:07 INFO - PROCESS | 1678 | 04:28:08 INFO - TEST-INFO | 1678: exit 0 04:28:08 INFO - TEST-OK | kraken | took 58386ms 04:28:08 INFO - SUITE-END | took 1168s 04:28:08 INFO - Completed test suite (00:19:28) 04:28:08 INFO - javascript benchmark 04:28:08 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3560.679538841504, 3566.661167189116, 3613.945790813138, 3616.5117709109263, 3636.2000359920808, 5917.0, 5949.107633854924, 5990.071538911465, 6008.098785182219, 6035.0, 4605.723656580608, 5834.920539700159, 5855.063189889618, 5948.524118070555, 6029.306629737582, 5281.603879709028, 5339.092354299759, 5354.9196762048605, 5397.217403476494, 5408.215808707735, 433.37921450841884, 5275.709835959021, 5395.298611180541, 5421.566274698014, 5477.643953143053, 5338.706371149624, 5345.0, 5367.1680889462195, 5369.677819330833, 5370.462953704638, 5265.341832270966, 5383.057964856134, 5429.782808687648, 5435.646682965634, 5439.0, 5264.552513036397, 5269.894602107936, 5358.276632654581, 5383.111786555213, 5418.862038971821, 4865.953819928697, 5039.622028347889, 5866.911996320058, 5946.137810017523, 5949.345571987078, 6135.44703110649, 6189.87620247597, 6224.0, 6245.656488893109, 6304.590201636879, 6262.96868515659, 6278.121063051177, 6283.088952101965, 6297.086922396227, 6299.496040316763, 5989.970050149765, 5992.131140984577, 6009.909851352277, 6033.5173186145, 6089.117078023662, 6249.0, 6342.270638876496, 6377.5216858735785, 6378.107065010902, 6430.0, 6209.875802483925, 6223.875522489616, 6248.50011999039, 6250.781222657185, 6269.46709529686, 6333.20834895638, 6358.3641635836975, 6359.745610175633, 6381.1704478417505, 6387.0, 6138.662373569497, 6169.753209871555, 6234.1583886175695, 6261.123442718023, 6276.560640755103, 6166.383361663888, 6238.781642642486, 6251.937480625226, 6252.874942501125, 6287.434130928147, 3546.8226588670464, 4600.171969045537, 5038.949610503848, 5049.141645920203, 5068.594512438996, 3768.4347347897487, 4186.748795072244, 4457.821687132543, 4466.39703640011, 4552.226121559343, 5914.378990206053, 5931.436513531207, 5967.403259674084, 5984.850378740566, 6000.849978750566, 6327.335629758901, 6340.397662222082, 6356.491480681627, 6360.395762402564, 6368.554201205964, 5864.560157988168, 5960.970195148997, 6043.184170137063, 6046.486048685911, 6086.817395478142, 4583.175028494903, 5475.589330800206, 5495.340559132929, 5498.697571633598, 5606.074997625346, 6342.49260059185, 6557.770478033246, 6577.309382514863, 6578.407943285031, 6586.308437614078, 6251.249850018027, 6316.431521163117, 6364.109024736448, 6378.011408231731, 6389.329120442287, 6541.215054193527, 6561.606303621607, 6579.243387010555, 6579.967100164468, 6600.405963463311, 6123.404636889863, 6174.8147555573405, 6241.469475094668, 6279.905801413074, 6280.905786413116, 6353.396427339396, 6380.489560835215, 6396.264429590657, 6410.967945160244, 6422.775202867877, 6063.636181829104, 6174.598651087665, 6216.347283535164, 6217.751289948533, 6228.564000520101, 6091.116788065794, 6118.253719382578, 6123.5876691309595, 6217.96891015542, 6225.906611400923, 5085.237214417719, 6030.396960303934, 6090.246469782017, 6099.451049405575, 6154.107654389999, 6140.84169297792, 6210.968945155245, 6212.565120441525, 6214.658193799203, 6221.844453888689, 6045.214122164267, 6101.641069425342, 6132.509399248139, 6196.659183744938, 6199.969000154971], "unit": "score", "name": "dojo.html", "value": 5762.376154651329}, {"lowerIsBetter": false, "replicates": [447.9865604031878, 497.4056003076323, 518.9636725429219, 550.6585916731627, 646.1406329581657, 30548.0, 36924.815375923085, 36988.630113698855, 37027.4445883312, 37092.81453592735, 38077.0, 38292.0, 38552.614473855254, 38575.94952529979, 38592.80703596485, 9217.631294748202, 9310.581023853943, 9371.34400591959, 9469.248189085041, 9512.857307140399, 9298.907010929872, 9418.858717119248, 9471.431714097142, 9493.477858717803, 9531.857022144673, 9417.152456278967, 9456.38533495324, 9485.383450075724, 9529.190018848372, 9545.761355966122, 8095.797605059862, 8177.0, 9413.764655883624, 9432.056794320582, 9483.478408687519, 9318.021607731158, 9378.155965963027, 9399.812003759955, 9514.191293740041, 9580.377275477142, 36893.0, 37198.25603487942, 37548.0, 37965.0, 38003.0, 2374.726906405751, 2770.8476033818133, 2897.7102289771065, 3232.983835080833, 3324.5844269466315, 22014.00936957841, 26901.327466813487, 27028.0, 27383.45233095327, 27444.17667469979, 2731.7951153663553, 2753.4630747004344, 2860.7997440179197, 2888.1913064342016, 2964.1552157635188, 489218.99999999645, 492345.0, 499417.0, 500530.0, 504229.0, 66749.0, 67196.328036719, 67557.0, 67766.0, 67774.66112669405, 67471.0, 68085.0, 69603.65198173976, 69682.65158674175, 70299.64850175819, 16469.91765041167, 16636.0, 17074.231659575347, 17082.487525374258, 17147.74278385825, 12651.93674031624, 12864.871351286554, 12986.935065324613, 12994.740105198032, 13032.41354139066, 21201.575968480545, 21383.144674212857, 21647.567048658937, 21703.891480542497, 21706.457338566663, 8990.797254672647, 9238.538073096453, 9261.629534818532, 9283.860742088875, 9295.72112836616, 966.5747071288611, 1041.3959903256093, 1049.574922156528, 1093.0108252031923, 1142.6514912951463, 24444.0, 27822.026229081886, 28999.275018124295, 29170.562441563394, 29226.853865730962, 1072.201210098466, 1099.8790133085354, 1109.6615532262738, 1129.5594718059963, 1144.5993902134187, 14660.706785864222, 14740.705185896437, 14769.966102372731, 15051.473198438001, 15114.773278400833, 528263.0, 529191.0, 536265.0, 539648.0, 542999.0, 57156.14265786017, 57647.42352576504, 57939.0, 58226.70886645625, 58492.7075364629, 1367.405178747248, 1380.6893448974101, 1406.156306216262, 1456.155429850684, 1460.0655580428534, 24433.633495497226, 28673.856630716713, 28708.569371459027, 28709.995150169645, 29234.0, 49106.0, 49490.010199795084, 49540.75229623829, 49890.750546247036, 49928.50071499384, 480575.0, 484447.0, 486229.0, 487417.0, 491918.0, 30322.84838575793, 30431.717621178057, 31066.844665776527, 31195.84402077975, 31291.53062704107, 38004.80997595105, 42739.78630106954, 43981.12037759291, 44617.77691111524, 44997.10005799931, 25927.611085834105, 33706.0, 36100.38898490417, 36546.63453365432, 36675.26649467049, 35749.28501429905, 36047.639523605474, 36113.0, 36307.63692363042, 36761.0, 35115.19781017874, 35702.46446303256, 35704.464433033005, 36135.819320903225, 36594.90215293546, 30962.0, 31911.84044079765, 32042.679573203968, 32080.35839283248, 32104.83947580247, 22526.098956041576, 23824.761752382256, 24552.263432097065, 24553.263402097964, 24827.87586062058], "unit": "score", "name": "ext.html", "value": 19488.52032359545}, {"lowerIsBetter": false, "replicates": [347.5863722170617, 357.13395017083565, 359.7517712778183, 361.2179631098671, 364.1024873686363, 18978.81021189788, 18990.71513927292, 19198.23207071717, 19976.0, 19993.500162495944, 19525.0, 19612.509687257825, 19886.50283742907, 19921.800781992177, 20189.59620807583, 5537.141743029827, 5815.941840581603, 5861.120831875211, 5869.383714709958, 5877.559183061266, 4153.522344930327, 5721.113227449731, 5991.940080599204, 6051.909221361683, 6321.968390158043, 6195.0, 6263.31103578606, 6265.655388953605, 6270.996640537515, 6271.968640156816, 5985.88028239435, 6133.723982420802, 6161.168242287279, 6286.49708023357, 6307.4007969243075, 5296.364436267672, 5299.099153143975, 5307.363116426053, 5416.8104116356135, 5448.237246785453, 22379.888100559394, 23140.0, 23555.76444235553, 23631.645525317133, 24363.269101926795, 2040.0615716770303, 2073.02567793137, 2138.6791981202946, 2272.7954484096344, 2447.9963215081907, 9439.622415103388, 9565.952170239174, 9679.419234845931, 10038.397696138181, 10122.190224782, 1666.5417010322137, 1717.652772477914, 1752.7195648696147, 1769.796473405549, 1802.9008404537744, 78999.0, 108975.36536951872, 110077.0, 112250.0, 113095.0, 10600.310979786289, 10941.179411544166, 11089.944550277198, 11145.832812507819, 11416.885831141748, 13417.66455838612, 13520.18878867271, 13520.391582378816, 13573.253471059186, 13575.253361065235, 8224.753257402288, 8278.544680042656, 8303.211194936472, 8331.37514686401, 8389.832203356022, 6904.861902761917, 7386.852262954818, 8245.95877020611, 8568.0, 8699.478031318142, 4231.915361692749, 4280.892977675583, 4315.3095504719095, 4328.264195086843, 4369.80335884886, 1538.9307481163376, 1751.098184435017, 1809.0, 1875.559243577758, 1904.9428517144509, 867.280157469299, 872.6509396241554, 897.0, 937.4281688170211, 987.4026214140486, 17580.824191757918, 19936.3022294219, 20018.59962800736, 20146.39560813178, 20248.696269555967, 939.1735272959752, 939.9284815310551, 940.8400571902793, 948.7628092976756, 966.0966995858895, 7468.365188958891, 10272.691819245285, 10720.678379648623, 10870.510827012804, 10995.725106872233, 584544.0, 590952.0, 605697.0, 609907.0, 661949.0, 96825.0, 100680.49659751654, 109708.0, 115089.0, 118997.40501297438, 996.7308826616918, 1002.0830939690247, 1004.7387679203459, 1009.3893194617298, 1019.6788011776415, 17786.0, 17832.55418614493, 18288.634227315113, 18567.721484177477, 18573.535661608566, 48675.539733808044, 50525.74737126291, 50760.0, 50843.23735143902, 51328.74335628298, 71851.0, 71906.92139618014, 72138.0, 72239.0, 72353.0, 9266.934302555292, 10772.622958196738, 10908.400037997986, 11077.169212308949, 11545.595904143314, 12526.311052892179, 13066.869331306565, 13284.53504127351, 13640.317984100953, 13670.794938076137, 7786.961065194864, 9858.112769850748, 11246.1565382595, 11401.771964560829, 11427.257228280136, 7650.885236721342, 7817.140114587504, 7983.3127903669565, 8074.152214017444, 8129.8374032520205, 7990.800229994296, 8087.797805054685, 8136.123411652674, 8342.749717508485, 8413.915860841558, 11179.217454778413, 11345.205835591429, 11585.594504192313, 11668.766624667629, 11735.295882247092, 11285.71785705364, 11422.086233101165, 11432.885671143182, 11437.370944598128, 11770.3526306054], "unit": "score", "name": "jquery.html", "value": 9253.215761107249}, {"lowerIsBetter": false, "replicates": [1575.5194665626982, 1591.5225432370287, 1851.5926496170846, 1947.7565304336958, 1968.8523360747947, 7851.48965317254, 8462.788430289245, 8558.144185581446, 8763.430377025497, 8812.0, 8540.57297135144, 8540.743777686665, 8557.786055348619, 8596.699115530957, 8648.783780405493, 2418.504206637644, 2421.092090466075, 2439.9634005489934, 2468.222509909373, 2469.753024697534, 2086.478380404899, 2387.7970372518357, 2418.854868707874, 2431.124795073772, 2480.6651102101255, 2387.3554140382084, 2429.441228517442, 2465.8767061646936, 2467.1858286765414, 2482.5407299649623, 2413.505231427553, 2431.817613678981, 2461.913833015845, 2464.839785413951, 2479.590867506859, 2386.5226954608975, 2387.7970372518357, 2398.5322862041908, 2415.698037745282, 2458.729539750626, 8555.95722021392, 8656.740297791013, 8699.565021748951, 8702.912970870273, 8739.737807865775, 5339.519443250126, 5346.091164502044, 5347.759350829222, 5389.461053894618, 5510.173473978895, 3539.203679172191, 3620.0406892173596, 3621.2395396966667, 3642.307961487309, 3681.5398075240596, 1052.8772851658537, 1053.499587695846, 1063.5533076108054, 1069.9358038517714, 1076.424113099488, 11571.94214028933, 11862.051035917106, 11865.5847045353, 11876.287422754576, 11899.107566932427, 4787.8563643090765, 4859.1496488114435, 4960.355153830051, 4987.301777751118, 5002.949970500248, 9674.08096230857, 9692.22462203022, 9758.316917815826, 9841.0, 9924.0, 5335.973320133375, 5337.172738225581, 5357.330333708286, 5383.300170977826, 5398.379186393615, 4448.288273876229, 4767.69010014348, 4909.705417674951, 4923.384576927884, 4974.1543937530705, 3856.9614303857165, 3859.7298189127055, 3917.8236979335998, 3950.7827069511454, 3978.482797236341, 1132.3488993828582, 1320.854705982341, 1333.8266025416633, 1334.6996925691642, 1337.237774468563, 1322.2000689582856, 1357.321339330335, 1364.733876894016, 1379.2069560003038, 1394.4422231107435, 8042.839143217103, 8195.672173113127, 8207.835843283101, 8211.917880821235, 8217.0, 521.0256819747098, 522.5636593444441, 526.8366806290062, 527.2776296473855, 527.862755683525, 5193.4027586828, 6035.577509574376, 6223.937760622426, 6252.343503932022, 6257.937420625826, 10059.346142500714, 10282.948585257176, 10294.227932905062, 10373.325733827278, 10423.009814067651, 9919.454430006419, 10054.899451005542, 10224.0, 10272.640457583948, 10286.485675716185, 7950.801229969297, 7950.840983180304, 8009.879851802228, 8028.4781489203015, 8118.634661440249, 7699.230076992256, 7838.451308408356, 7873.37013038967, 7880.211978802074, 7996.24035716606, 9087.63649454041, 9125.406848554823, 9304.488253146143, 9402.623895044122, 9523.952380238332, 7964.20357964199, 9369.156775890202, 9417.623295068395, 9468.14786669203, 9594.088561586637, 6546.18172728409, 6617.0, 7084.468664850054, 7295.452841037049, 7335.8532829344185, 6775.661216939232, 7944.0, 7948.085970113511, 8104.8784268237205, 8138.593070346577, 6139.877202456015, 6662.966685166737, 6902.137232845895, 7121.394681452135, 7393.001944737392, 6704.765333213314, 6746.0, 7120.964395177991, 7126.679299431435, 7320.377767889789, 7386.630668466448, 7586.696532138652, 7611.885821712568, 7613.428992825449, 7669.118051424158, 6751.864962700817, 6767.796966091025, 6876.965615171892, 6924.619145947021, 6930.13373328334, 6724.092247546519, 6882.931170688429, 6884.139482564679, 6961.79114626562, 6964.965175174294], "unit": "score", "name": "mootools.html", "value": 4768.476431973903}, {"lowerIsBetter": false, "replicates": [325.34118410219315, 325.8338247493778, 328.02739876266867, 335.0, 336.8770398804437, 5753.9999999999945, 6573.309802470743, 6858.622775747332, 6867.896981545275, 6872.312768723125, 6845.657717114137, 6860.245373008977, 6867.313268673131, 6874.518783685144, 6880.621565813878, 4772.04559088182, 4852.927206091911, 5001.274815151801, 5005.474425185358, 5011.649184557083, 4033.7781422021776, 5013.523715247045, 5015.022070696215, 5018.548330650241, 5060.367454068241, 4952.975235123819, 4957.975210123945, 4969.031038947407, 4974.278729584208, 4986.925196122061, 4954.207326827708, 4958.0, 5001.574866136347, 5011.173156429203, 5047.293378926953, 4315.697901146921, 4335.5014173370155, 4339.457567804025, 4343.284402660963, 4347.804348804311, 6364.0, 6594.373534514213, 6615.569987950767, 6692.163479565054, 6695.3639404257, 5892.793752218695, 5929.911051334234, 5932.703364831785, 5942.554308426886, 5976.760929562813, 6126.356732543063, 7163.817970034938, 7308.415326773846, 7317.5609463432365, 7356.705731770723, 4821.37322148122, 4840.588549973257, 4841.757912104381, 4847.612191024745, 4880.316755654211, 6857.897131542981, 7620.542767433972, 7664.770056898246, 7686.193744470045, 7720.922790772077, 4761.761911904391, 4829.806807727722, 4862.927056094161, 4881.609471242292, 4889.339939108246, 4095.89760255996, 4947.925781113287, 4950.331705219821, 4950.603951683856, 4966.553010229097, 5889.705514724246, 5933.525317974638, 5948.167256584082, 5965.492933100648, 5966.76132954677, 7341.045664063744, 7360.705571777069, 7410.184879663233, 7416.7033318666645, 7427.257274272638, 1629.3075442936704, 1702.2254874032285, 1709.290644382592, 1726.6978278801412, 1736.426979096895, 1006.572206812102, 1108.706192858893, 1118.6588090632436, 1136.6874109619755, 1144.547903578082, 5794.449527294901, 5906.26171728534, 6394.648294343856, 6742.954841999498, 6854.691538880762, 6621.470282377399, 7570.697172113164, 7578.924210757932, 7584.317411432998, 7618.047744031996, 6704.899426508607, 6767.154105736783, 6769.763058292936, 6779.9322006780285, 6793.354631310018, 3872.9806350968065, 3993.281209382339, 4040.0505881117915, 4047.9392809107885, 4060.5330387005283, 7142.857142857218, 7145.856662933906, 7638.961805190938, 8079.394045446615, 8233.588320583947, 6404.5516813823515, 7947.960260198662, 7991.320737737357, 7996.24035716606, 8001.239882211181, 6115.602485838406, 8002.159773223961, 8041.155678653774, 8057.153998830038, 8084.919150808417, 7371.152317483558, 7677.539347639159, 7689.269519395649, 7693.88459173124, 7752.612369381395, 6055.576109672281, 7498.025256716592, 7499.362554182955, 7520.8495830082, 7535.246475352421, 6465.741370345321, 8008.079070906687, 8062.475939063942, 8081.272685458337, 8102.068262149693, 4937.407511098691, 4952.77712502931, 4957.281194226744, 4960.280759289955, 4975.0547395994645, 7363.926360736324, 7679.616019199129, 7694.307512323918, 7701.730439434593, 7711.768646940601, 7338.486305958745, 7372.96313518429, 7374.1151061872915, 7379.741709040158, 7395.667194976131, 7364.447666424932, 7365.0, 7388.741394051397, 7390.852182956418, 7413.925860741324, 6031.944409728368, 7075.681594328371, 7130.322619351154, 7159.284071592799, 7169.598184608006, 7076.646167691698, 7360.300771426706, 7406.407487401103, 7436.219196984239, 7436.516626419266, 7171.103612048494, 7192.525532265978, 7228.819279518054, 7231.059962204879, 7237.782866514013], "unit": "score", "name": "prototype.html", "value": 5319.105485131644}, {"lowerIsBetter": false, "replicates": [690.3407246079993, 697.5849369625074, 724.5362967700669, 728.0244472406977, 754.9811254718632, 14481.782773258383, 14848.1091134532, 14999.85000149998, 15061.246937653115, 15091.169985650798, 13799.586012419619, 13821.0, 13821.37803798829, 13826.792598111037, 13831.723365532684, 733.6845156582681, 893.9150780675825, 921.6037104045258, 923.9122283383068, 971.6939164163266, 893.8569828827389, 909.9853663165555, 914.1041779056495, 922.727795300388, 931.3201363005011, 924.2559739409772, 939.6241503398627, 966.2801213096218, 968.5544649461257, 970.4953424219402, 914.561010714854, 956.0726095687207, 961.6538046303325, 965.2760429677742, 966.5988614724881, 727.3344889426169, 729.3946024799404, 730.9488335816495, 731.1263040666406, 731.6926890705917, 11636.360000199986, 14119.929400353036, 14156.150630962175, 14201.0, 14722.55832325032, 12860.421281042376, 12861.228326300452, 13023.0, 13111.47554097835, 13180.275084870329, 9945.90054099457, 9964.950175249078, 10047.0, 10106.49467526628, 10110.393376397366, 3413.6415676354122, 3476.2526056897887, 3486.1633208030144, 3540.7875527468436, 3723.385641369171, 71132.0, 72979.63510182415, 73057.9041314386, 73275.0, 73360.63319683421, 9197.678081267257, 9367.953160234292, 9389.436633801994, 9404.670836520689, 9453.43279403238, 20755.792442075384, 21202.469938251357, 21244.0, 21556.676649850266, 21917.452063698216, 7405.555666660018, 7419.332260096618, 7434.929406073405, 7590.316871481593, 7661.693532258759, 3946.1515774108702, 4089.1821635672986, 4097.0, 4100.774457404812, 4108.404281379183, 3438.6045604755773, 3465.358908601917, 3530.382183117944, 3546.255286389887, 3576.4277715565904, 629.2134831460675, 632.9968350158312, 633.7908490198223, 634.9015902535023, 653.095462784038, 550.2241839006981, 606.5966132521912, 612.908063790435, 613.6962203709103, 641.2977789320686, 7751.435312426706, 8112.269895709414, 8240.340772738167, 8272.420930534925, 8303.418760686694, 544.8583368324264, 565.6210339072832, 589.5725598940734, 617.2777849915609, 633.8700566383881, 3526.9470957935137, 3537.656914216041, 3774.1319496515957, 3818.904527386782, 3891.377379619304, 82538.0, 83599.0, 83696.0, 83793.16206837975, 84239.57880210559, 79562.40875182464, 79957.40511138701, 82675.58662206771, 82680.58659706663, 82811.0, 71212.64393677999, 71761.92357114647, 71954.28045719476, 72290.0, 73269.26730732624, 6634.933650663432, 7805.765827025199, 7809.687612495437, 7823.921760782319, 7858.292753652198, 51199.48800511947, 51234.97530049453, 51341.0, 52293.477065230385, 52309.0, 65452.672736636014, 66848.6657566709, 70344.0, 71972.0, 72908.63545682238, 10424.895751042393, 10562.577496900345, 10609.575616975235, 10687.358758474516, 10753.1935104869, 11592.826107608562, 11715.941420292844, 11734.413279335828, 11819.881801181878, 12293.815592766294, 10663.89336106629, 11185.32888026721, 11281.548738050715, 11437.256578322382, 11605.767884642091, 9755.830068096482, 11149.331040137618, 11726.510491905628, 11855.940720296343, 12174.695632608902, 10940.234183607072, 10971.725706857393, 11091.001809837153, 11403.258788179073, 11702.531898723955, 9291.442513448945, 9425.0, 9515.714528564155, 9537.627010479968, 9669.9033009669, 7578.886316705364, 9454.574544145667, 9613.51932403363, 9747.805043899225, 9770.218382529238], "unit": "score", "name": "yui.html", "value": 6839.234185942409}], "name": "dromaeo_css", "value": 7516.035644922974}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [120.0, 155.0, 116.0, 116.0, 116.0, 124.0, 114.0, 115.0, 116.0, 115.0], "unit": "score", "name": "ai-astar", "value": 120.7}, {"lowerIsBetter": true, "replicates": [150.0, 133.0, 132.0, 182.0, 148.0, 179.0, 164.0, 129.0, 195.0, 151.0], "unit": "score", "name": "audio-beat-detection", "value": 156.3}, {"lowerIsBetter": true, "replicates": [223.0, 277.0, 203.0, 206.0, 229.0, 196.0, 194.0, 194.0, 229.0, 273.0], "unit": "score", "name": "audio-dft", "value": 222.4}, {"lowerIsBetter": true, "replicates": [64.0, 81.0, 74.0, 112.0, 59.0, 58.0, 57.0, 62.0, 125.0, 58.0], "unit": "score", "name": "audio-fft", "value": 75.0}, {"lowerIsBetter": true, "replicates": [83.0, 78.0, 123.0, 81.0, 82.0, 87.0, 117.0, 82.0, 80.0, 122.0], "unit": "score", "name": "audio-oscillator", "value": 93.5}, {"lowerIsBetter": true, "replicates": [90.0, 95.0, 117.0, 87.0, 99.0, 119.0, 89.0, 94.0, 76.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 98.1}, {"lowerIsBetter": true, "replicates": [152.0, 96.0, 118.0, 130.0, 144.0, 106.0, 96.0, 95.0, 97.0, 95.0], "unit": "score", "name": "imaging-darkroom", "value": 112.9}, {"lowerIsBetter": true, "replicates": [93.0, 94.0, 91.0, 118.0, 127.0, 92.0, 91.0, 96.0, 92.0, 92.0], "unit": "score", "name": "imaging-desaturate", "value": 98.6}, {"lowerIsBetter": true, "replicates": [57.0, 58.0, 57.0, 57.0, 57.0, 56.0, 58.0, 64.0, 59.0, 56.0], "unit": "score", "name": "json-parse-financial", "value": 57.9}, {"lowerIsBetter": true, "replicates": [65.0, 55.0, 73.0, 89.0, 98.0, 98.0, 92.0, 55.0, 85.0, 97.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 80.7}, {"lowerIsBetter": true, "replicates": [87.0, 84.0, 85.0, 85.0, 86.0, 83.0, 85.0, 83.0, 88.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.1}, {"lowerIsBetter": true, "replicates": [126.0, 134.0, 136.0, 108.0, 144.0, 133.0, 138.0, 145.0, 123.0, 145.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 133.2}, {"lowerIsBetter": true, "replicates": [140.0, 142.0, 139.0, 140.0, 144.0, 135.0, 143.0, 138.0, 140.0, 141.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 140.2}, {"lowerIsBetter": true, "replicates": [57.0, 97.0, 97.0, 95.0, 96.0, 95.0, 67.0, 66.0, 88.0, 76.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 83.4}], "name": "kraken", "value": 1558.0000000000002}]} 04:28:08 INFO - Return code: 0 04:28:08 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 04:28:08 ERROR - # TBPL SUCCESS # 04:28:08 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 04:28:08 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 04:28:08 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 04:28:08 INFO - 2016-04-05 04:28:08.755 screenresolution[1683:10849] starting screenresolution argv=screenresolution get 04:28:08 INFO - 2016-04-05 04:28:08.758 screenresolution[1683:10849] Display 0: 1600x1200x32@60 04:28:08 INFO - 2016-04-05 04:28:08.764 screenresolution[1684:10852] starting screenresolution argv=screenresolution list 04:28:08 INFO - Available Modes on Display 0 04:28:08 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 04:28:08 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 04:28:08 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 04:28:08 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 04:28:09 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 04:28:09 INFO - Intel Iris: 04:28:09 INFO - Chipset Model: Intel Iris 04:28:09 INFO - Type: GPU 04:28:09 INFO - Bus: Built-In 04:28:09 INFO - VRAM (Dynamic, Max): 1536 MB 04:28:09 INFO - Vendor: Intel (0x8086) 04:28:09 INFO - Device ID: 0x0a2e 04:28:09 INFO - Revision ID: 0x0009 04:28:09 INFO - Displays: 04:28:09 INFO - Display: 04:28:09 INFO - Resolution: 1600 x 1200 @ 60 Hz 04:28:09 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 04:28:09 INFO - Display Serial Number: 1600x1200 60 04:28:09 INFO - Main Display: Yes 04:28:09 INFO - Mirror: Off 04:28:09 INFO - Online: Yes 04:28:09 INFO - Rotation: Supported 04:28:09 INFO - Return code: 0 04:28:09 INFO - Running post-action listener: _resource_record_post_action 04:28:09 INFO - Running post-run listener: _resource_record_post_run 04:28:10 INFO - Total resource usage - Wall time: 1204s; CPU: 54.0%; Read bytes: 37660160; Write bytes: 700208128; Read time: 395; Write time: 2027 04:28:10 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 241664; Write bytes: 402564608; Read time: 5; Write time: 709 04:28:10 INFO - run-tests - Wall time: 1171s; CPU: 54.0%; Read bytes: 35874304; Write bytes: 296795648; Read time: 377; Write time: 1317 04:28:10 INFO - Running post-run listener: _upload_blobber_files 04:28:10 INFO - Blob upload gear active. 04:28:10 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:28:10 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 04:28:10 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', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:28:10 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 Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:28:10 INFO - (blobuploader) - INFO - Open directory for files ... 04:28:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:28:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:28:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:28:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:28:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:28:11 INFO - (blobuploader) - INFO - Done attempting. 04:28:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:28:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:28:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:28:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:28:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:28:12 INFO - (blobuploader) - INFO - Done attempting. 04:28:12 INFO - (blobuploader) - INFO - Iteration through files over. 04:28:12 INFO - Return code: 0 04:28:12 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:28:12 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:28:12 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ec15c4827f4148139933395187953a2109f89ffee597b16f20c7642c4e95b5210b42e02df59dc8566037b87b3dc8b846d86cb4442f0f368b78555fe076711f49", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4e304492ded8c66f9851ad280ffc4254fef5147530d53446e42b42fe48c9536f0496ea7a4db3523082bef973e40f131eda979f6acc0ec27f5070803e2a30e003"} 04:28:12 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:28:12 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:28:12 INFO - Contents: 04:28:12 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ec15c4827f4148139933395187953a2109f89ffee597b16f20c7642c4e95b5210b42e02df59dc8566037b87b3dc8b846d86cb4442f0f368b78555fe076711f49", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4e304492ded8c66f9851ad280ffc4254fef5147530d53446e42b42fe48c9536f0496ea7a4db3523082bef973e40f131eda979f6acc0ec27f5070803e2a30e003"} 04:28:12 INFO - Running post-run listener: copy_logs_to_upload_dir 04:28:12 INFO - Copying logs to upload dir... 04:28:12 INFO - mkdir: /builds/slave/test/build/upload/logs 04:28:12 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1273.703108 ========= master_lag: 2.92 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 16 secs) (at 2016-04-05 04:28:15.656176) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-05 04:28:15.659407) ========= 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.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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/Firefox/sha512/ec15c4827f4148139933395187953a2109f89ffee597b16f20c7642c4e95b5210b42e02df59dc8566037b87b3dc8b846d86cb4442f0f368b78555fe076711f49", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4e304492ded8c66f9851ad280ffc4254fef5147530d53446e42b42fe48c9536f0496ea7a4db3523082bef973e40f131eda979f6acc0ec27f5070803e2a30e003"} build_url:https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011251 build_url: 'https://queue.taskcluster.net/v1/task/U6PQaT2OS7K8sN6Ccxjkkw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ec15c4827f4148139933395187953a2109f89ffee597b16f20c7642c4e95b5210b42e02df59dc8566037b87b3dc8b846d86cb4442f0f368b78555fe076711f49", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4e304492ded8c66f9851ad280ffc4254fef5147530d53446e42b42fe48c9536f0496ea7a4db3523082bef973e40f131eda979f6acc0ec27f5070803e2a30e003"}' ========= master_lag: 0.41 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-05 04:28:16.082475) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-05 04:28:16.082802) ========= 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.rQEvGItJvk/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.bVHnKYuLCR/Listeners TMPDIR=/var/folders/h6/mf44gd353f7dv2g4t9vfyz5w00000w/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.005699 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-05 04:28:16.137129) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-05 04:28:16.137441) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-05 04:28:16.137822) ========= ========= Total master_lag: 12.43 =========