builder: mozilla-aurora_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0086 starttime: 1460114966.36 results: success (0) buildid: 20160408030457 builduid: 4aa879a095e342a1b7b604a5f80a401f revision: b7ac08e2f3abca76cd06f9a151a95dec3531b89f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.356192) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.356635) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.356931) ========= 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.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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.005881 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.384383) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.384696) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.452472) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.452924) ========= 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.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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.005241 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.510642) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.510950) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.511329) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.511600) ========= 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.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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-08 04:29:26-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 11.6M=0.001s 2016-04-08 04:29:26 (11.6 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.204729 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.743534) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.743805) ========= 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.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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.019757 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:26.810701) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-08 04:29:26.811234) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b7ac08e2f3abca76cd06f9a151a95dec3531b89f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b7ac08e2f3abca76cd06f9a151a95dec3531b89f --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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-08 04:29:26,886 truncating revision to first 12 chars 2016-04-08 04:29:26,886 Setting DEBUG logging. 2016-04-08 04:29:26,887 attempt 1/10 2016-04-08 04:29:26,887 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/b7ac08e2f3ab?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-08 04:29:27,812 unpacking tar archive at: mozilla-aurora-b7ac08e2f3ab/testing/mozharness/ program finished with exit code 0 elapsedTime=1.179467 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-08 04:29:28.009304) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:28.009616) ========= echo b7ac08e2f3abca76cd06f9a151a95dec3531b89f in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'b7ac08e2f3abca76cd06f9a151a95dec3531b89f'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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 b7ac08e2f3abca76cd06f9a151a95dec3531b89f program finished with exit code 0 elapsedTime=0.005099 script_repo_revision: 'b7ac08e2f3abca76cd06f9a151a95dec3531b89f' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:28.059998) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:28.060281) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-08 04:29:28.077496) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 4 secs) (at 2016-04-08 04:29:28.077862) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:29:28 INFO - MultiFileLogger online at 20160408 04:29:28 in /builds/slave/test 04:29:28 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 04:29:28 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:29:28 INFO - {'append_to_log': False, 04:29:28 INFO - 'base_work_dir': '/builds/slave/test', 04:29:28 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 04:29:28 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:29:28 INFO - 'branch': 'Mozilla-Aurora', 04:29:28 INFO - 'buildbot_json_path': 'buildprops.json', 04:29:28 INFO - 'config_files': ('talos/mac_config.py',), 04:29:28 INFO - 'default_actions': ('clobber', 04:29:28 INFO - 'read-buildbot-config', 04:29:28 INFO - 'download-and-extract', 04:29:28 INFO - 'populate-webroot', 04:29:28 INFO - 'create-virtualenv', 04:29:28 INFO - 'install', 04:29:28 INFO - 'run-tests'), 04:29:28 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:29:28 INFO - 'download_minidump_stackwalk': True, 04:29:28 INFO - 'download_symbols': 'ondemand', 04:29:28 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:29:28 INFO - 'tooltool.py': '/tools/tooltool.py', 04:29:28 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:29:28 INFO - '/tools/misc-python/virtualenv.py')}, 04:29:28 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:29:28 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:29:28 INFO - 'installer_path': 'installer.exe', 04:29:28 INFO - 'log_level': 'info', 04:29:28 INFO - 'log_name': 'talos', 04:29:28 INFO - 'log_to_console': True, 04:29:28 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 04:29:28 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 04:29:28 INFO - 'opt_config_files': (), 04:29:28 INFO - 'pip_index': False, 04:29:28 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 04:29:28 INFO - 'cmd': ('bash', 04:29:28 INFO - '-c', 04:29:28 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 04:29:28 INFO - 'enabled': True, 04:29:28 INFO - 'halt_on_failure': False, 04:29:28 INFO - 'name': 'check_screen_resolution'},), 04:29:28 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 04:29:28 INFO - 'cmd': ('bash', 04:29:28 INFO - '-c', 04:29:28 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 04:29:28 INFO - 'enabled': True, 04:29:28 INFO - 'halt_on_failure': False, 04:29:28 INFO - 'name': 'check_screen_resolution'},), 04:29:28 INFO - 'run_cmd_checks_enabled': True, 04:29:28 INFO - 'sps_profile': False, 04:29:28 INFO - 'sps_profile_interval': 0, 04:29:28 INFO - 'suite': 'dromaeojs-e10s', 04:29:28 INFO - 'system_bits': '32', 04:29:28 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:29:28 INFO - 'title': 't-yosemite-r7-0086', 04:29:28 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:29:28 INFO - 'use_talos_json': True, 04:29:28 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:29:28 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:29:28 INFO - 'work_dir': 'build'} 04:29:28 INFO - ##### 04:29:28 INFO - ##### Running clobber step. 04:29:28 INFO - ##### 04:29:28 INFO - Running pre-action listener: _resource_record_pre_action 04:29:28 INFO - Running main action method: clobber 04:29:28 INFO - rmtree: /builds/slave/test/build 04:29:28 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:29:29 INFO - Running post-action listener: _resource_record_post_action 04:29:29 INFO - ##### 04:29:29 INFO - ##### Running read-buildbot-config step. 04:29:29 INFO - ##### 04:29:29 INFO - Running pre-action listener: _resource_record_pre_action 04:29:29 INFO - Running main action method: read_buildbot_config 04:29:29 INFO - Using buildbot properties: 04:29:29 INFO - { 04:29:29 INFO - "project": "", 04:29:29 INFO - "product": "firefox", 04:29:29 INFO - "script_repo_revision": "production", 04:29:29 INFO - "builddir": "mozilla-aurora_yosemite_r7_test-dromaeojs-e10s", 04:29:29 INFO - "repository": "", 04:29:29 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-aurora talos dromaeojs-e10s", 04:29:29 INFO - "buildid": "20160408030457", 04:29:29 INFO - "pgo_build": "False", 04:29:29 INFO - "basedir": "/builds/slave/test", 04:29:29 INFO - "buildnumber": 254, 04:29:29 INFO - "slavename": "t-yosemite-r7-0086", 04:29:29 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 04:29:29 INFO - "platform": "yosemite_r7", 04:29:29 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 04:29:29 INFO - "branch": "mozilla-aurora", 04:29:29 INFO - "repo_path": "releases/mozilla-aurora", 04:29:29 INFO - "revision": "b7ac08e2f3abca76cd06f9a151a95dec3531b89f", 04:29:29 INFO - "stage_platform": "macosx64", 04:29:29 INFO - "builduid": "4aa879a095e342a1b7b604a5f80a401f", 04:29:29 INFO - "slavebuilddir": "test" 04:29:29 INFO - } 04:29:29 INFO - Found installer url https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg. 04:29:29 INFO - Running post-action listener: _resource_record_post_action 04:29:29 INFO - ##### 04:29:29 INFO - ##### Running download-and-extract step. 04:29:29 INFO - ##### 04:29:29 INFO - Running pre-action listener: _resource_record_pre_action 04:29:29 INFO - Running main action method: download_and_extract 04:29:29 INFO - mkdir: /builds/slave/test/build/tests 04:29:29 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:29:29 INFO - https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json matches https://queue.taskcluster.net 04:29:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json 04:29:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json 04:29:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-47.0a2.en-US.mac.test_packages.json 04:29:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.mac.test_packages.json'}, attempt #1 04:30:00 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json: timed out 04:30:00 INFO - retry: attempt #1 caught exception: timed out 04:30:00 INFO - retry: Failed, sleeping 30 seconds before retrying 04:30:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.mac.test_packages.json'}, attempt #2 04:30:31 INFO - Downloaded 1277 bytes. 04:30:31 INFO - Reading from file /builds/slave/test/build/firefox-47.0a2.en-US.mac.test_packages.json 04:30:31 INFO - Using the following test package requirements: 04:30:31 INFO - {u'common': [u'firefox-47.0a2.en-US.mac.common.tests.zip'], 04:30:31 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 04:30:31 INFO - u'firefox-47.0a2.en-US.mac.cppunittest.tests.zip'], 04:30:31 INFO - u'gtest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 04:30:31 INFO - u'firefox-47.0a2.en-US.mac.gtest.tests.zip'], 04:30:31 INFO - u'jittest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 04:30:31 INFO - u'jsshell-mac.zip'], 04:30:31 INFO - u'mochitest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 04:30:31 INFO - u'firefox-47.0a2.en-US.mac.mochitest.tests.zip'], 04:30:31 INFO - u'mozbase': [u'firefox-47.0a2.en-US.mac.common.tests.zip'], 04:30:31 INFO - u'reftest': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 04:30:31 INFO - u'firefox-47.0a2.en-US.mac.reftest.tests.zip'], 04:30:31 INFO - u'talos': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 04:30:31 INFO - u'firefox-47.0a2.en-US.mac.talos.tests.zip'], 04:30:31 INFO - u'web-platform': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 04:30:31 INFO - u'firefox-47.0a2.en-US.mac.web-platform.tests.zip'], 04:30:31 INFO - u'webapprt': [u'firefox-47.0a2.en-US.mac.common.tests.zip'], 04:30:31 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.mac.common.tests.zip', 04:30:31 INFO - u'firefox-47.0a2.en-US.mac.xpcshell.tests.zip']} 04:30:31 INFO - Downloading packages: [u'firefox-47.0a2.en-US.mac.common.tests.zip'] for test suite category: common 04:30:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:30:31 INFO - https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 04:30:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip 04:30:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip 04:30:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip 04:30:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip'}, attempt #1 04:30:32 INFO - Downloaded 17904113 bytes. 04:30:32 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:30:32 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 04:30:35 INFO - Return code: 0 04:30:35 INFO - Downloading packages: [u'firefox-47.0a2.en-US.mac.common.tests.zip', u'firefox-47.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 04:30:35 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:30:35 INFO - https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 04:30:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip 04:30:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip 04:30:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip 04:30:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip'}, attempt #1 04:30:38 INFO - Downloaded 17904113 bytes. 04:30:38 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:30:38 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 04:30:42 INFO - Return code: 0 04:30:42 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:30:42 INFO - https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 04:30:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip 04:30:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip 04:30:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.mac.talos.tests.zip 04:30:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.talos.tests.zip'}, attempt #1 04:30:43 INFO - Downloaded 10845168 bytes. 04:30:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:30:43 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 04:30:43 INFO - Return code: 0 04:30:43 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:30:43 INFO - https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg matches https://queue.taskcluster.net 04:30:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg 04:30:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg 04:30:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-47.0a2.en-US.mac.dmg 04:30:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.mac.dmg'}, attempt #1 04:30:48 INFO - Downloaded 115183466 bytes. 04:30:48 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg 04:30:48 INFO - mkdir: /builds/slave/test/properties 04:30:48 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:30:48 INFO - Writing to file /builds/slave/test/properties/build_url 04:30:48 INFO - Contents: 04:30:48 INFO - build_url:https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg 04:30:49 INFO - Running post-action listener: _resource_record_post_action 04:30:49 INFO - Running post-action listener: set_extra_try_arguments 04:30:49 INFO - ##### 04:30:49 INFO - ##### Running populate-webroot step. 04:30:49 INFO - ##### 04:30:49 INFO - Running pre-action listener: _resource_record_pre_action 04:30:49 INFO - Running main action method: populate_webroot 04:30:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:30:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:30:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:30:49 INFO - '--tppagecycles', 04:30:49 INFO - '7'], 04:30:49 INFO - 'tests': ['tsvgm']}}, 04:30:49 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:30:49 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:30:49 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 04:30:49 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:30:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:30:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:30:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:30:49 INFO - 'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:30:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:30:49 INFO - 'tests': ['damp', 'tps']}, 04:30:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:30:49 INFO - 'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['damp', 'tps']}, 04:30:49 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:30:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:30:49 INFO - 'other': {'tests': ['a11yr', 04:30:49 INFO - 'ts_paint', 04:30:49 INFO - 'tpaint', 04:30:49 INFO - 'sessionrestore', 04:30:49 INFO - 'sessionrestore_no_auto_restore', 04:30:49 INFO - 'tabpaint']}, 04:30:49 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['a11yr', 04:30:49 INFO - 'ts_paint', 04:30:49 INFO - 'tpaint', 04:30:49 INFO - 'sessionrestore', 04:30:49 INFO - 'sessionrestore_no_auto_restore', 04:30:49 INFO - 'tabpaint']}, 04:30:49 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['a11yr', 04:30:49 INFO - 'ts_paint', 04:30:49 INFO - 'tpaint', 04:30:49 INFO - 'sessionrestore', 04:30:49 INFO - 'sessionrestore_no_auto_restore', 04:30:49 INFO - 'tabpaint']}, 04:30:49 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['a11yr', 04:30:49 INFO - 'ts_paint', 04:30:49 INFO - 'tpaint', 04:30:49 INFO - 'sessionrestore', 04:30:49 INFO - 'sessionrestore_no_auto_restore', 04:30:49 INFO - 'tabpaint']}, 04:30:49 INFO - 'other_l64': {'tests': ['a11yr', 04:30:49 INFO - 'ts_paint', 04:30:49 INFO - 'tpaint', 04:30:49 INFO - 'sessionrestore', 04:30:49 INFO - 'sessionrestore_no_auto_restore', 04:30:49 INFO - 'tabpaint']}, 04:30:49 INFO - 'other_nol64': {'tests': ['a11yr', 04:30:49 INFO - 'ts_paint', 04:30:49 INFO - 'tpaint', 04:30:49 INFO - 'sessionrestore', 04:30:49 INFO - 'sessionrestore_no_auto_restore', 04:30:49 INFO - 'tabpaint']}, 04:30:49 INFO - 'svgr': {'tests': ['tsvgx', 04:30:49 INFO - 'tsvgr_opacity', 04:30:49 INFO - 'tart', 04:30:49 INFO - 'tscrollx', 04:30:49 INFO - 'cart']}, 04:30:49 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['tsvgx', 04:30:49 INFO - 'tsvgr_opacity', 04:30:49 INFO - 'tart', 04:30:49 INFO - 'tscrollx', 04:30:49 INFO - 'cart']}, 04:30:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:30:49 INFO - 'tests': ['tp5o']}, 04:30:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:30:49 INFO - 'talos_options': ['--e10s'], 04:30:49 INFO - 'tests': ['tp5o']}, 04:30:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:30:49 INFO - 'talos_options': ['--xperf_path', 04:30:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:30:49 INFO - 'tests': ['tp5n']}, 04:30:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:30:49 INFO - 'talos_options': ['--e10s', 04:30:49 INFO - '--xperf_path', 04:30:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:30:49 INFO - 'tests': ['tp5n']}}, 04:30:49 INFO - 'talos.zip': {'path': '', 04:30:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:30:49 INFO - Running post-action listener: _resource_record_post_action 04:30:49 INFO - ##### 04:30:49 INFO - ##### Running create-virtualenv step. 04:30:49 INFO - ##### 04:30:49 INFO - Running pre-action listener: _resource_record_pre_action 04:30:49 INFO - Running main action method: create_virtualenv 04:30:49 INFO - Creating virtualenv /builds/slave/test/build/venv 04:30:49 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:30:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:30:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:30:49 INFO - Using real prefix '/tools/python27' 04:30:49 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:30:50 INFO - Installing distribute.............................................................................................................................................................................................done. 04:30:53 INFO - Installing pip.................done. 04:30:53 INFO - Return code: 0 04:30:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:30:53 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:30:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:30:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:30:53 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:30:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:30:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:30:53 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 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:30:53 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:30:53 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:30:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:30:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:30:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:30:53 INFO - 'HOME': '/Users/cltbld', 04:30:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:30:53 INFO - 'LOGNAME': 'cltbld', 04:30:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:30:53 INFO - 'MOZ_NO_REMOTE': '1', 04:30:53 INFO - 'NO_EM_RESTART': '1', 04:30:53 INFO - 'PAGER': '/bin/cat', 04:30:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:30:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:30:53 INFO - 'PWD': '/builds/slave/test', 04:30:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:30:53 INFO - 'SHELL': '/bin/bash', 04:30:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:30:53 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:30:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:30:53 INFO - 'USER': 'cltbld', 04:30:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:30:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:30:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:30:53 INFO - 'XPC_FLAGS': '0x0', 04:30:53 INFO - 'XPC_SERVICE_NAME': '0', 04:30:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:30:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:30:53 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:30:53 INFO - Cleaning up... 04:30:53 INFO - Return code: 0 04:30:53 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:30:53 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:30:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:30:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:30:53 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:30:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:30:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:30:53 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 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:30:53 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:30:53 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:30:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:30:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:30:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:30:53 INFO - 'HOME': '/Users/cltbld', 04:30:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:30:53 INFO - 'LOGNAME': 'cltbld', 04:30:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:30:53 INFO - 'MOZ_NO_REMOTE': '1', 04:30:53 INFO - 'NO_EM_RESTART': '1', 04:30:53 INFO - 'PAGER': '/bin/cat', 04:30:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:30:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:30:53 INFO - 'PWD': '/builds/slave/test', 04:30:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:30:53 INFO - 'SHELL': '/bin/bash', 04:30:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:30:53 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:30:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:30:53 INFO - 'USER': 'cltbld', 04:30:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:30:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:30:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:30:53 INFO - 'XPC_FLAGS': '0x0', 04:30:53 INFO - 'XPC_SERVICE_NAME': '0', 04:30:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:30:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:30:53 INFO - Downloading/unpacking psutil>=0.7.1 04:30:53 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:30:53 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:30:53 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:30:53 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:30:53 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:30:53 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:30:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:30:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:30:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:30:56 INFO - Installing collected packages: psutil 04:30:56 INFO - Running setup.py install for psutil 04:30:56 INFO - building 'psutil._psutil_osx' extension 04:30:56 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:30:57 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:30:57 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:30:57 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:30:57 INFO - building 'psutil._psutil_posix' extension 04:30:57 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:30:57 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 04:30:57 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 04:30:57 INFO - ^ 04:30:57 INFO - 1 warning generated. 04:30:57 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:30:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:30:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:30:57 INFO - Successfully installed psutil 04:30:57 INFO - Cleaning up... 04:30:57 INFO - Return code: 0 04:30:57 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:30:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:30:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:30:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:30:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:30:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:30:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:30:57 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 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:30:57 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:30:57 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:30:57 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:30:57 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:30:57 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:30:57 INFO - 'HOME': '/Users/cltbld', 04:30:57 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:30:57 INFO - 'LOGNAME': 'cltbld', 04:30:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:30:57 INFO - 'MOZ_NO_REMOTE': '1', 04:30:57 INFO - 'NO_EM_RESTART': '1', 04:30:57 INFO - 'PAGER': '/bin/cat', 04:30:57 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:30:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:30:57 INFO - 'PWD': '/builds/slave/test', 04:30:57 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:30:57 INFO - 'SHELL': '/bin/bash', 04:30:57 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:30:57 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:30:57 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:30:57 INFO - 'USER': 'cltbld', 04:30:57 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:30:57 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:30:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:30:57 INFO - 'XPC_FLAGS': '0x0', 04:30:57 INFO - 'XPC_SERVICE_NAME': '0', 04:30:57 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:30:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:30:57 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:30:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:30:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:30:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:30:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:30:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:30:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:00 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:31:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:31:00 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:31:00 INFO - Installing collected packages: mozsystemmonitor 04:31:00 INFO - Running setup.py install for mozsystemmonitor 04:31:00 INFO - Successfully installed mozsystemmonitor 04:31:00 INFO - Cleaning up... 04:31:00 INFO - Return code: 0 04:31:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:31: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:31:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:31:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31: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:31:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:31:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:31:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:31:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 04:31:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:31:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:31:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:31:00 INFO - 'HOME': '/Users/cltbld', 04:31:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:31:00 INFO - 'LOGNAME': 'cltbld', 04:31:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:31:00 INFO - 'MOZ_NO_REMOTE': '1', 04:31:00 INFO - 'NO_EM_RESTART': '1', 04:31:00 INFO - 'PAGER': '/bin/cat', 04:31:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:31:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:31:00 INFO - 'PWD': '/builds/slave/test', 04:31:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:31:00 INFO - 'SHELL': '/bin/bash', 04:31:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:31:00 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:31:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:31:00 INFO - 'USER': 'cltbld', 04:31:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:31:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:31:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:31:00 INFO - 'XPC_FLAGS': '0x0', 04:31:00 INFO - 'XPC_SERVICE_NAME': '0', 04:31:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:31:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:31:01 INFO - Downloading/unpacking blobuploader==1.2.4 04:31:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:03 INFO - Downloading blobuploader-1.2.4.tar.gz 04:31:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:31:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:31: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:31: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:31: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:31: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:31: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:31: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:31:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:31:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:31:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:04 INFO - Downloading docopt-0.6.1.tar.gz 04:31:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:31:04 INFO - Installing collected packages: blobuploader, requests, docopt 04:31:04 INFO - Running setup.py install for blobuploader 04:31:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:31:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:31:04 INFO - Running setup.py install for requests 04:31:05 INFO - Running setup.py install for docopt 04:31:05 INFO - Successfully installed blobuploader requests docopt 04:31:05 INFO - Cleaning up... 04:31:05 INFO - Return code: 0 04:31:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:31:05 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:31:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:31:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:05 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:31:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:31:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:05 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 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:31:05 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:31:05 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:31:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:31:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:31:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:31:05 INFO - 'HOME': '/Users/cltbld', 04:31:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:31:05 INFO - 'LOGNAME': 'cltbld', 04:31:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:31:05 INFO - 'MOZ_NO_REMOTE': '1', 04:31:05 INFO - 'NO_EM_RESTART': '1', 04:31:05 INFO - 'PAGER': '/bin/cat', 04:31:05 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:31:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:31:05 INFO - 'PWD': '/builds/slave/test', 04:31:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:31:05 INFO - 'SHELL': '/bin/bash', 04:31:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:31:05 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:31:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:31:05 INFO - 'USER': 'cltbld', 04:31:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:31:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:31:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:31:05 INFO - 'XPC_FLAGS': '0x0', 04:31:05 INFO - 'XPC_SERVICE_NAME': '0', 04:31:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:31:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:31:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:31:05 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-Sy7Iqy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-iESkdL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-Mi5LN1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-dNrbf9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-SgqP67-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-8ZLCPZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-uAF5Bm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-fPfQZR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-v1yABx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-OqwrTh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:31:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:31:06 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-Uf_dHx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:31:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:31:07 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-EzRCF_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:31:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:31:07 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-fotvoS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:31:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:31:07 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-nRsfO4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:31:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:31:07 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-TF0bgF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:31:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:31:07 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-ufBqna-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:31:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:31:07 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-f4slSI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:31:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:31:07 INFO - Running setup.py install for manifestparser 04:31:07 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:31:07 INFO - Running setup.py install for mozcrash 04:31:07 INFO - Running setup.py install for mozdebug 04:31:08 INFO - Running setup.py install for mozdevice 04:31:08 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:31:08 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:31:08 INFO - Running setup.py install for mozfile 04:31:08 INFO - Running setup.py install for mozhttpd 04:31:08 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:31:08 INFO - Running setup.py install for mozinfo 04:31:08 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:31:08 INFO - Running setup.py install for mozInstall 04:31:08 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:31:08 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:31:08 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:31:08 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:31:08 INFO - Running setup.py install for mozleak 04:31:08 INFO - Running setup.py install for mozlog 04:31:09 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:31:09 INFO - Running setup.py install for moznetwork 04:31:09 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:31:09 INFO - Running setup.py install for mozprocess 04:31:09 INFO - Running setup.py install for mozprofile 04:31:09 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:31:09 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:31:09 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:31:09 INFO - Running setup.py install for mozrunner 04:31:09 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:31:09 INFO - Running setup.py install for mozscreenshot 04:31:09 INFO - Running setup.py install for moztest 04:31:10 INFO - Running setup.py install for mozversion 04:31:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:31:10 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:31:10 INFO - Cleaning up... 04:31:10 INFO - Return code: 0 04:31:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:31:10 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:31:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:31:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:10 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:31:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:31:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:10 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 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:31:10 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:31:10 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:31:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:31:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:31:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:31:10 INFO - 'HOME': '/Users/cltbld', 04:31:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:31:10 INFO - 'LOGNAME': 'cltbld', 04:31:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:31:10 INFO - 'MOZ_NO_REMOTE': '1', 04:31:10 INFO - 'NO_EM_RESTART': '1', 04:31:10 INFO - 'PAGER': '/bin/cat', 04:31:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:31:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:31:10 INFO - 'PWD': '/builds/slave/test', 04:31:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:31:10 INFO - 'SHELL': '/bin/bash', 04:31:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:31:10 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:31:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:31:10 INFO - 'USER': 'cltbld', 04:31:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:31:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:31:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:31:10 INFO - 'XPC_FLAGS': '0x0', 04:31:10 INFO - 'XPC_SERVICE_NAME': '0', 04:31:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:31:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:31:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:31:10 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-YsOkqU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:31:10 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:31:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:31:10 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-YhAPjD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:31:10 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:31:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:31:10 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-xLNTmU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:31:10 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:31:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:31:10 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-xsIChy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:31:10 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:31:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:31:10 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-gNUViC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-7iFjtY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-Ipbb02-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-U0nEmY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-B6Ktgn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-wOlbNK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-dRg_Qo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-mrJAnb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-eCJ_rc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:31:11 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:31:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:31:11 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-pcMg9P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:31:12 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:31:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:31:12 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-ZDixu6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:31:12 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:31:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:31:12 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-bL1a5V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:31:12 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:31:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:31:12 INFO - Running setup.py (path:/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/pip-Ax0A62-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:31:12 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:31:12 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:31:12 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:31:12 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:31:12 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:31:12 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:31:12 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:31:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:14 INFO - Downloading blessings-1.6.tar.gz 04:31:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:31:14 INFO - Installing collected packages: blessings 04:31:14 INFO - Running setup.py install for blessings 04:31:15 INFO - Successfully installed blessings 04:31:15 INFO - Cleaning up... 04:31:15 INFO - Return code: 0 04:31:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:31:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:31:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:31:15 INFO - Reading from file tmpfile_stdout 04:31:15 INFO - Current package versions: 04:31:15 INFO - blessings == 1.6 04:31:15 INFO - blobuploader == 1.2.4 04:31:15 INFO - docopt == 0.6.1 04:31:15 INFO - manifestparser == 1.1 04:31:15 INFO - mozInstall == 1.12 04:31:15 INFO - mozcrash == 0.17 04:31:15 INFO - mozdebug == 0.1 04:31:15 INFO - mozdevice == 0.48 04:31:15 INFO - mozfile == 1.2 04:31:15 INFO - mozhttpd == 0.7 04:31:15 INFO - mozinfo == 0.9 04:31:15 INFO - mozleak == 0.1 04:31:15 INFO - mozlog == 3.1 04:31:15 INFO - moznetwork == 0.27 04:31:15 INFO - mozprocess == 0.22 04:31:15 INFO - mozprofile == 0.28 04:31:15 INFO - mozrunner == 6.11 04:31:15 INFO - mozscreenshot == 0.1 04:31:15 INFO - mozsystemmonitor == 0.0 04:31:15 INFO - moztest == 0.7 04:31:15 INFO - mozversion == 1.4 04:31:15 INFO - psutil == 3.1.1 04:31:15 INFO - requests == 1.2.3 04:31:15 INFO - wsgiref == 0.1.2 04:31:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:31:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:31:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:31:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:31:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:31:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:15 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 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:31:15 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:31:15 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:31:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:31:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:31:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:31:15 INFO - 'HOME': '/Users/cltbld', 04:31:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:31:15 INFO - 'LOGNAME': 'cltbld', 04:31:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:31:15 INFO - 'MOZ_NO_REMOTE': '1', 04:31:15 INFO - 'NO_EM_RESTART': '1', 04:31:15 INFO - 'PAGER': '/bin/cat', 04:31:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:31:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:31:15 INFO - 'PWD': '/builds/slave/test', 04:31:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:31:15 INFO - 'SHELL': '/bin/bash', 04:31:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:31:15 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:31:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:31:15 INFO - 'USER': 'cltbld', 04:31:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:31:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:31:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:31:15 INFO - 'XPC_FLAGS': '0x0', 04:31:15 INFO - 'XPC_SERVICE_NAME': '0', 04:31:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:31:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:31:15 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:31:15 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:31:15 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:31:15 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:31:15 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:31:15 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:31:15 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:31:15 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:31:15 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:31:15 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:31:15 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:31:15 INFO - Cleaning up... 04:31:15 INFO - Return code: 0 04:31:15 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:31:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:31:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:31:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:31:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:31:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:31:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:31:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:31:15 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:31:15 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:31:15 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:31:15 INFO - 'HOME': '/Users/cltbld', 04:31:15 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:31:15 INFO - 'LOGNAME': 'cltbld', 04:31:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:31:15 INFO - 'MOZ_NO_REMOTE': '1', 04:31:15 INFO - 'NO_EM_RESTART': '1', 04:31:15 INFO - 'PAGER': '/bin/cat', 04:31:15 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:31:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:31:15 INFO - 'PWD': '/builds/slave/test', 04:31:15 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:31:15 INFO - 'SHELL': '/bin/bash', 04:31:15 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:31:15 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:31:15 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:31:15 INFO - 'USER': 'cltbld', 04:31:15 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:31:15 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:31:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:31:15 INFO - 'XPC_FLAGS': '0x0', 04:31:15 INFO - 'XPC_SERVICE_NAME': '0', 04:31:15 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:31:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:31:16 INFO - Downloading/unpacking jsonschema 04:31:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:18 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:31:18 INFO - Downloading/unpacking functools32 (from jsonschema) 04:31:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:18 INFO - Downloading functools32-3.2.3-2.tar.gz 04:31:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:31:19 INFO - warning: no files found matching '*.txt' 04:31:19 INFO - no previously-included directories found matching 'build' 04:31:19 INFO - no previously-included directories found matching 'dist' 04:31:19 INFO - no previously-included directories found matching '.git*' 04:31:19 INFO - Installing collected packages: jsonschema, functools32 04:31:19 INFO - Running setup.py install for functools32 04:31:19 INFO - warning: no files found matching '*.txt' 04:31:19 INFO - no previously-included directories found matching 'build' 04:31:19 INFO - no previously-included directories found matching 'dist' 04:31:19 INFO - no previously-included directories found matching '.git*' 04:31:19 INFO - Successfully installed jsonschema functools32 04:31:19 INFO - Cleaning up... 04:31:19 INFO - Return code: 0 04:31:19 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:31:19 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:31:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:31:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:19 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:31:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:31:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:31:19 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 0x102d19a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102d204c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb75a58ed40>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, '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.IohbLoszpP/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.J9dkZbBjBj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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:31:19 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:31:19 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:31:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:31:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:31:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:31:19 INFO - 'HOME': '/Users/cltbld', 04:31:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:31:19 INFO - 'LOGNAME': 'cltbld', 04:31:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:31:19 INFO - 'MOZ_NO_REMOTE': '1', 04:31:19 INFO - 'NO_EM_RESTART': '1', 04:31:19 INFO - 'PAGER': '/bin/cat', 04:31:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:31:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:31:19 INFO - 'PWD': '/builds/slave/test', 04:31:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:31:19 INFO - 'SHELL': '/bin/bash', 04:31:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:31:19 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:31:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:31:19 INFO - 'USER': 'cltbld', 04:31:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:31:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:31:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:31:19 INFO - 'XPC_FLAGS': '0x0', 04:31:19 INFO - 'XPC_SERVICE_NAME': '0', 04:31:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:31:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:31:19 INFO - Downloading/unpacking flake8 04:31:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:31:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:31:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:31:21 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:31:22 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:31:22 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:31:22 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:31:22 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:31:22 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:31:22 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:31:22 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:31:22 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:31:22 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:31:22 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:31:22 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:31:22 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:31:22 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:31:22 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:31:22 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:31:22 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:31:22 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:31:22 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:31:22 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:31:22 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:31:22 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:31:22 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:31:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:31:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:31:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:31:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:31:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:31:23 INFO - no previously-included directories found matching 'docs/_build' 04:31:23 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:31:23 INFO - Running setup.py install for pep8 04:31:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:31:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:31:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:31:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:31:23 INFO - no previously-included directories found matching 'docs/_build' 04:31:23 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:31:23 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:31:23 INFO - Cleaning up... 04:31:23 INFO - Return code: 0 04:31:23 INFO - Running post-action listener: _resource_record_post_action 04:31:23 INFO - Running post-action listener: _start_resource_monitoring 04:31:23 INFO - Starting resource monitoring. 04:31:23 INFO - ##### 04:31:23 INFO - ##### Running install step. 04:31:23 INFO - ##### 04:31:23 INFO - Running pre-action listener: _resource_record_pre_action 04:31:23 INFO - Running main action method: install 04:31:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:31:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:31:23 INFO - Reading from file tmpfile_stdout 04:31:23 INFO - Detecting whether we're running mozinstall >=1.0... 04:31:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:31:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:31:24 INFO - Reading from file tmpfile_stdout 04:31:24 INFO - Output received: 04:31:24 INFO - Usage: mozinstall [options] installer 04:31:24 INFO - Options: 04:31:24 INFO - -h, --help show this help message and exit 04:31:24 INFO - -d DEST, --destination=DEST 04:31:24 INFO - Directory to install application into. [default: 04:31:24 INFO - "/builds/slave/test"] 04:31:24 INFO - --app=APP Application being installed. [default: firefox] 04:31:24 INFO - mkdir: /builds/slave/test/build/application 04:31:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 04:31:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 04:31:57 INFO - Reading from file tmpfile_stdout 04:31:57 INFO - Output received: 04:31:57 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 04:31:57 INFO - Running post-action listener: _resource_record_post_action 04:31:57 INFO - ##### 04:31:57 INFO - ##### Running run-tests step. 04:31:57 INFO - ##### 04:31:57 INFO - Running pre-action listener: _resource_record_pre_action 04:31:57 INFO - Running main action method: run_tests 04:31:57 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 04:31:57 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 04:31:57 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 04:31:57 INFO - 2016-04-08 04:31:57.412 screenresolution[1927:15429] starting screenresolution argv=screenresolution get 04:31:57 INFO - 2016-04-08 04:31:57.415 screenresolution[1927:15429] Display 0: 1600x1200x32@60 04:31:57 INFO - 2016-04-08 04:31:57.421 screenresolution[1928:15431] starting screenresolution argv=screenresolution list 04:31:57 INFO - Available Modes on Display 0 04:31:57 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 04:31:57 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 04:31:57 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 04:31:57 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 04:31:57 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 04:31:57 INFO - Intel Iris: 04:31:57 INFO - Chipset Model: Intel Iris 04:31:57 INFO - Type: GPU 04:31:57 INFO - Bus: Built-In 04:31:57 INFO - VRAM (Dynamic, Max): 1536 MB 04:31:57 INFO - Vendor: Intel (0x8086) 04:31:57 INFO - Device ID: 0x0a2e 04:31:57 INFO - Revision ID: 0x0009 04:31:57 INFO - Displays: 04:31:57 INFO - Display: 04:31:57 INFO - Resolution: 1600 x 1200 @ 60 Hz 04:31:57 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 04:31:57 INFO - Display Serial Number: 1600x1200 60 04:31:57 INFO - Main Display: Yes 04:31:57 INFO - Mirror: Off 04:31:57 INFO - Online: Yes 04:31:57 INFO - Rotation: Supported 04:31:57 INFO - Return code: 0 04:31:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:31:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:31:57 INFO - Python 2.7.3 04:31:57 INFO - Return code: 0 04:31:57 INFO - grabbing minidump binary from tooltool 04:31:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:31:57 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102bbdd30>, '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 0x102a21db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102bb4b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:31:57 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 04:31:57 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 04:31:57 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:31:57 INFO - Return code: 0 04:31:57 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 04:31:57 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:31:57 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:31:57 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 04:31:57 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:31:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:31:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:31:58 INFO - Return code: 0 04:31:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0086', '--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:31:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0086 --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:31:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.IohbLoszpP/Render', 04:31:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:31:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:31:58 INFO - 'HOME': '/Users/cltbld', 04:31:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:31:58 INFO - 'LOGNAME': 'cltbld', 04:31:58 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:31:58 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 04:31:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:31:58 INFO - 'MOZ_NO_REMOTE': '1', 04:31:58 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:31:58 INFO - 'NO_EM_RESTART': '1', 04:31:58 INFO - 'PAGER': '/bin/cat', 04:31:58 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:31:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:31:58 INFO - 'PWD': '/builds/slave/test', 04:31:58 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:31:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:31:58 INFO - 'SHELL': '/bin/bash', 04:31:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.J9dkZbBjBj/Listeners', 04:31:58 INFO - 'TMPDIR': '/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/', 04:31:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:31:58 INFO - 'USER': 'cltbld', 04:31:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:31:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:31:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:31:58 INFO - 'XPC_FLAGS': '0x0', 04:31:58 INFO - 'XPC_SERVICE_NAME': '0', 04:31:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:31:58 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0086', '--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:31:59 INFO - mozversion application_buildid: 20160408030457 04:31:59 INFO - mozversion application_changeset: b7ac08e2f3abca76cd06f9a151a95dec3531b89f 04:31:59 INFO - mozversion application_display_name: FirefoxDeveloperEdition 04:31:59 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:31:59 INFO - mozversion application_name: Firefox 04:31:59 INFO - mozversion application_remotingname: firefox-dev 04:31:59 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 04:31:59 INFO - mozversion application_vendor: Mozilla 04:31:59 INFO - mozversion application_version: 47.0a2 04:31:59 INFO - mozversion platform_buildid: 20160408030457 04:31:59 INFO - mozversion platform_changeset: b7ac08e2f3abca76cd06f9a151a95dec3531b89f 04:31:59 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 04:31:59 INFO - mozversion platform_version: 47.0a2 04:31:59 INFO - using testdate: 1460115119 04:31:59 INFO - actual date: 1460115119 04:31:59 INFO - starting webserver on 'localhost:51439' 04:31:59 INFO - SUITE-START | Running 2 tests 04:31:59 INFO - TEST-START | dromaeo_css 04:31:59 INFO - operating with platform_type : mac_ 04:31:59 INFO - Initialising browser for dromaeo_css test... 04:31:59 INFO - TEST-INFO | started process 1946 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/tmpu_kGiW/profile http://localhost:51439/getInfo.html) 04:32:01 INFO - PROCESS | 1946 | __metrics Screen width/height:1600/1200 04:32:01 INFO - PROCESS | 1946 | colorDepth:24 04:32:01 INFO - PROCESS | 1946 | Browser inner width/height: 1024/689 04:32:01 INFO - PROCESS | 1946 | __metrics 04:32:01 ERROR - PROCESS | 1946 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 04:32:02 INFO - TEST-INFO | 1946: exit 0 04:32:02 INFO - Browser initialized. 04:32:02 INFO - Running cycle 1/1 for dromaeo_css test... 04:32:02 INFO - TEST-INFO | started process 1949 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/tmpu_kGiW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:32:14 INFO - PROCESS | 1949 | RSS: Main: 217690112 04:32:14 INFO - PROCESS | 1949 | 04:33:04 INFO - PROCESS | 1949 | 1460115184073 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:35:14 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:51439/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51439/tests/dromaeo/cssquery-ext.html) 04:35:15 INFO - PROCESS | 1949 | RSS: Main: 228630528 04:35:15 INFO - PROCESS | 1949 | 04:38:17 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:51439/tests/dromaeo/cssquery-ext.html (next: http://localhost:51439/tests/dromaeo/cssquery-jquery.html) 04:38:18 INFO - PROCESS | 1949 | RSS: Main: 240496640 04:38:18 INFO - PROCESS | 1949 | 04:41:20 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:51439/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51439/tests/dromaeo/cssquery-mootools.html) 04:41:20 INFO - PROCESS | 1949 | RSS: Main: 241684480 04:41:20 INFO - PROCESS | 1949 | 04:44:22 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:51439/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51439/tests/dromaeo/cssquery-prototype.html) 04:44:22 INFO - PROCESS | 1949 | RSS: Main: 243662848 04:44:22 INFO - PROCESS | 1949 | 04:47:25 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:51439/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51439/tests/dromaeo/cssquery-yui.html) 04:47:26 INFO - PROCESS | 1949 | RSS: Main: 246079488 04:47:26 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | Cycle 1(1): loaded http://localhost:51439/tests/dromaeo/cssquery-yui.html (next: http://localhost:51439/tests/dromaeo/cssquery-dojo.html) 04:50:28 INFO - PROCESS | 1949 | RSS: Main: 247414784 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | __start_tp_report 04:50:28 INFO - PROCESS | 1949 | _x_x_mozilla_page_load 04:50:28 INFO - PROCESS | 1949 | _x_x_mozilla_page_load_details 04:50:28 INFO - PROCESS | 1949 | |i|pagename|runs| 04:50:28 INFO - PROCESS | 1949 | |0;dojo.html;3504.229069604687;3538.699210567101;3568.8044505090793;3592.73054520911;3610.963890361097;5705.4294570542925;5722.113072473768;5738.713064346782;5753.685923840042;5759.971200143998;5720.542356611471;5720.742566584503;5726.055200891848;5753.021986262335;5755.913661295084;5169;5190.195519694454;5216.321878155834;5261.894762104775;5266.157414813631;4353.934690979622;5185.144451165553;5288.629795914288;5327.733613319338;5407.567394608442;5293.655912365703;5327.200919862033;5327.573794096483;5341.1187154119525;5355.919661205085;5330.227117068042;5338.866528336784;5362;5362.43694412085;5407.621466497347;5119.769610367543;5152.072626927152;5200.843974680765;5263.657862238981;5278;4695.295705644146;5583.3858275589655;5710.628809127394;5725.227094342252;5764.933487304862;6250.343713910065;6269.3730626937395;6274.058891166316;6308.558400911938;6321.209848768904;5246.685198888041;5594.748236329375;6168.475679567242;6239.87520249597;6308.684565771739;5884.47039766423;5895.587308888379;5904.3210030847;5914.852128696774;5916.4379383958885;5265.815696450606;6395;6408.198975128109;6415.722418541351;6418.326075761977;6109.908351374733;6196.659183744938;6243.906341404882;6287;6326.715297811609;6331.461825744863;6335.366463353628;6346.30190679025;6354.523410744213;6360.268569114519;5250.868728281824;6126.853582554517;6283.277423096311;6324.6521441321165;6355.396237357536;6270.467010304084;6299.96850015747;6331.778387756406;6336.429721325103;6344.333844946306;4938.851834444972;4946.332245146859;4973.5523802857915;4998.700077995332;5012;4406.1187762447;4428.33574963758;4512.842050528216;4519.322101684774;4546.136234115507;4394.252976993918;5872.588918775645;5898.970505147533;5956.8808623828145;6103.6032657877095;6248.5313601479165;6277.403646653561;6323.715432805535;6329.588576742497;6336.873262534724;5783.971080144573;5988.071848863433;5988.550858685616;5996.4603185713495;6005.189299444606;5386.91919621206;5434.538064264581;5460.972695136499;5473.890522189534;5500.834974950758;6463.418292353711;6474.061261117112;6483.610983341015;6489.156409666713;6507.056476810931;6226.782062627786;6251.374862513712;6294.590851594632;6321.589096708699;6326.082718005771;6444.097826304227;6525.8694826104165;6531.967340163269;6532.150820393318;6546.934530654823;6278.434940855345;6291;6319.304876463677;6322.905156422749;6336.651484168415;6265.8120256392385;6277.497800176066;6293.622382657055;6325.936740632719;6338.080978258219;6117.724702388314;6204.875902482016;6241.500679945684;6249.7500099997305;6284.057391391328;6069.241344831896;6239.438450539473;6244.718987645476;6258;6262.53031022666;5926.496247818984;6104.114903338902;6109.694515274307;6115.969420153048;6126.877462450637;6174.703312304287;6227.719752611234;6239.344868788712;6239.594426362272;6263.185785847811;6078.270607527125;6087.57386982907;6118.418750218722;6121.632702037892;6127.172831667668 04:50:28 INFO - PROCESS | 1949 | |1;ext.html;496.40859596338873;593.8040446652606;614.2046050364778;631.4758750237304;678.8357966088158;37935.43096853546;38505.42241866367;38567.61432385675;38595;38616.80691596542;39459.40810887839;39810.402843957294;40231.59768402315;40482.7975860121;40508.39237411434;9392.248620110391;9554;9612.567434465465;9639.277054220927;9740.561674724619;7903.40724445666;9132.771680707969;9604.423734575912;9705.369151005198;9728.270379721549;8840.248578870804;9742.976987416325;9783.853242201372;9785.510724463784;9814.018598140201;9678.274129440286;9725.0761177688;9748.976357482468;9768.169705575;9806.90193098067;9595.992420795787;9680.370775899544;9723.951380243125;9730.708078757649;9737.610495580167;34354.48468272978;39554;40300.19399612021;40795;40954;2743.931401714953;3258.96741032589;3273.29624130813;3477.9840426590254;3857.3635350167187;26986.86506567474;27037.864810676016;27080;27207;27415;2696.28548434665;2769.3907340385085;2803.6635603727477;2836.390176112125;2905.0848982570633;361822;388881;396859.0314096822;399221;402650;49126;49155.99999999929;49587.25619115716;68015.31984680188;68369.65815170892;49495.25757113646;50380.496195038315;50653;50747;50784.98430031379;17253.827461725472;17465.476035718948;17651.205695743465;17679;17688.823111768976;13748.93125534366;13956.72086558263;13993.790093148611;14019;14065.085769424955;15571.299291531908;15594.986325888782;15720.842791571939;15758.133302668462;15789.894707370604;5592.944070559323;6060.818175454743;6202.2867370253;6638.96680516604;6669.1330127083165;993.8608594796734;1057.2704833664748;1064.5954537275786;1132.5866058888446;1149.9022583080532;22698;29392.26519337034;29692.109236722932;29904.85047574748;30326.241843953638;1136.9147313951487;1145.9484323205477;1159.13644334971;1169.3919162035863;1257.2456526084459;15283.515957128351;15362.539123826304;15436.536903892902;15491.5352539424;15690.372385104696;461110;462077;464634;467165;469027;60643.69678151581;61389.07916381258;61460.692696537124;61922;62095.6895215521;1535.7619568966827;1550.4340915565738;1553.712563175816;1565.4833904811385;1580.8498192671677;25124;29286.707132928397;30175;30583.694163058084;30761.230969225948;53439.465605345;53691.194632079765;53951.730241348545;54117.45882541282;54195.729021354644;452195;460222;462231;462412;465629;32936.84721034752;34255.486167708004;34865;35209.295814084086;35480;46480.767596163154;47058.76470617625;47301.52698473109;47313;48103.75948120237;37580.436293456165;37901.05247368838;38444.42333365058;38579;39094;37194.27366153514;37443.25113497769;37619.43570846385;37965.81017094897;38574.68551886896;31729.365412692077;37803.810980944916;38051.80974095112;38431.423528646534;38528.614713853625;33149.834250829554;33173.336533269685;33279.334413312085;33582.49626255657;33937.83031084829;25599.872000639876;25890.61164082578;25917.22248332553;26098.34754131086;26192.8690356547 04:50:28 INFO - PROCESS | 1949 | |2;jquery.html;372.3000758573881;377.23797928185064;380.0233400161585;381.7099004756386;388.40573921899505;19827.504312392197;20297.898510507446;20551.38345849623;20993.47516312093;21062.262820801257;10530.946905309465;11838.289702617827;12353.07351948603;12392;12470.251784892913;5205.713685747282;5555.638883472561;5994.280686317648;5994.910076348859;6009.218801555813;5866.970665146669;5984.910226346608;5987.970060149693;6031.306399764039;6032.577719559633;5535.58483113766;5779.566532510057;5782.24830771999;5793.217915581385;5905.173275741399;5712.828615141531;5730.968425683396;5758.424157584229;6263.71813268404;6703.430208432289;5751.626144300607;5871.3541510433815;5903.439173278532;5916.4675179233645;5919.733611987471;13876;19602;20041.39875803728;26191.869040654867;26750.063747768734;2087.1025459052603;2101.3275751759443;2165.9783402165936;2167.934961951144;2650.3639126609473;9689.806203875953;10068.244881633907;10176.389416635026;10206.387616742944;10485.58057677692;1766.4082532351676;1849.1586328220628;1880.9059547022594;1968.468513501361;1996.2913165826212;105069.84790456298;110522;113853.43073284664;124759.9999999991;126524.36737816253;19594.90202548978;19839.908805015864;20160.39518814438;20271.986400679907;20517.076731547117;30295.697043029286;31113.222169445493;31295.84352078225;31564.684353156634;31734.04797856068;11311.773764524663;11332.943335283271;11498.94250528742;11644.76710465786;11808;9671.806563868684;9791.265655075898;9839.606415743434;9876.012398760067;9916.454594997344;8941.508217047995;9094;9173.58718857653;9174.770630734285;9198.034206408365;3100.3179300553843;3517.120719820045;3550.183457804668;3579.409397449444;3692.507557398799;884.1070518776082;945.1352012908112;969.7042402067297;1065.9467026648636;1118.7650593375483;16961.745573816403;20310.984450777403;20518.487037824172;21028.579428411347;21106.472338191666;847.6100993542916;990.7968866382374;1007.3754272351189;1010.5604062232952;1012.1396812709138;11042.889571104346;11131.72170695739;11243.044341230923;11876.940615296868;12053;464725;469140;469246;621299.5740085264;627905;87285;118536;118722;120718.3964080174;121245.18132228023;1030.2685093583489;1044.9059584637419;1045.994770026145;1061.5541472581535;1076.6339444588878;18231;18318.777292576313;18491.44525664232;18542.721859171852;18622.255109795457;39056.804715976235;42237.78881105575;50684;51426.74286628543;51673;70447;72012;74394.51210975858;75584.62207688927;77250.84123738261;7952.125266220595;8105.635246414044;8150.26647601695;8228.136045715113;8477.915220847959;9489.715308540755;13035.674108147372;13116.475340986253;13398.799018014932;13489.865101349253;9333.766655833659;10292.433916134685;10672.413017284123;10709.464526773474;11612.593559225386;10839.620613278497;10977.780444391226;11274.943625281821;11494.655160345203;11622.76754464889;11489.82765258505;11727.706807329543;11807.881921180679;11914.404279785802;12043;8130.75607731769;8192.918070819216;8217.972753405824;8270.917290827014;8345.41582089248;10499.737506562396;11214.439278036229;11595.652130436101;11621.186516943733;11669.35818529989 04:50:28 INFO - PROCESS | 1949 | |3;mootools.html;1378.510628726802;1618.3364820423626;1767.780231640169;1872.2136702584912;2021.807928246817;8120.5939703014765;8776.868346974801;8837.823243535126;9040.050794666557;9063.003069662333;8879.733607991771;8901.910980890205;8961.641534338618;8967.596458159382;8970.3272254581;2550.9744902551015;2577.9742202578013;2584.8061395395325;2585.31489155374;2590.261775394013;2514.8113891458124;2539.923802285925;2547.9490410191784;2559.6800399950007;2560.359910022494;2491.7632824881607;2507.1726330311044;2508.761667641571;2537.3276081838326;2551;2542.3389918621106;2556.3736884463237;2569.3448170716442;2586.0690151545427;2595.260350800032;2517.672702548657;2540.276021333911;2541.1995221505167;2554.604036374365;2559.1298958354064;8866.157715017063;8979.281657467387;8995.32535059873;9024.729258122266;9035.819283614292;5548.91676624851;5634.9857025735355;5662.150677398382;5673.319201695782;5684.204211410406;3562.5012498250267;3649.6715295623258;3697.0572504011307;3711.109333759905;3725.6460636239512;1063.6117816996818;1066.5049846435247;1078.8381742738652;1079.4063265204186;1081.853949716786;11916.702082447922;12042.879571204263;12191.939040304831;12245.326507042199;12273.324967126804;4933.50664933511;5024.698518088926;5028.673136246132;5074.644774865724;5115.7442127893455;9358.859617105749;9933.00669933001;10397.376157430426;10408.323458975143;10464.476776161162;5522.950639378505;5638.718064096779;5639.154126881001;5667.008273552195;5680.6591604503865;4472.955270447319;4528.932066019012;4897.338859253955;5003.749812509433;5058.848234552969;4093.640148587693;4104.52797928242;4112.403701463271;4120.381942708617;4148.170365926827;1329.5413082486527;1366.7334869700512;1369.1169195868808;1372.9038967272195;1377.6004958562105;1370.2189751841554;1396.818413606245;1418.5318844781198;1443.501991812823;1449.4709431057588;8320.334373250125;8539.444936079135;8600.182982616641;8605.311575074104;8614.05245423003;1264.4436447962867;1270.7649084919135;1270.8602053774077;1279.500994612102;1301.4533895763614;5090.490950904954;6320.810375688737;6401.487880969511;6414.711337989802;6487.740490380332;10362.896371036344;10653.467326633638;10714;10779.568817247378;10804.729881753019;10392.272540922215;10698.625548105934;10745.409002504937;10777.83833242502;10851.186161037796;8421.368397370221;8541.359398045171;8582.485050896841;8591.183837535424;8623.913760862437;7843.294103530709;8093.150219227132;8127.349812014906;8147.470414423044;8177.836443271221;9549.809003820024;9734.707958761248;9748.22014238845;9801.803963920824;9912;10032.398056116657;10092.596296148073;10143;10232.64185753495;10262.076413122557;6155.784547540815;7633.770986870402;7694.923050769645;7768.572728499987;7771.72798952034;8156.143604921398;8246.83506329882;8287.046989596274;8301.916980830356;8337.624806883583;7283.308085731847;7465;7471.8879216812875;7485.700571977278;7551;7364.153122390993;7423.406127509678;7434.665440055319;7505.399568034653;7523.435742319458;7873.212678732081;7907.48601340911;7939.642716077675;7986.041674999037;7999.120096789465;7127.572345659277;7167.964160179165;7182.820429489305;7234.276572342724;7277.745278915424;7194.532355396883;7217.170025447141;7251.20236773965;7258.274172582699;7266.7093316266755 04:50:28 INFO - PROCESS | 1949 | |4;prototype.html;332.9483929990852;334.33634236041456;338.8627605819644;342.64707351428035;343.70098014727176;6330.6834658267135;6750.898736518956;6752.763653272136;6778.423833974112;6804.795856124318;6697;6751.156105486814;6775.1531058617675;6780.254172041072;6790.762323318685;4759.190937540609;4858.740685581221;4939.876503087416;4963.354763880709;5005.474425185367;3964.7224694271267;4019.4171845082446;4931.334269873557;4939.086269040221;5071.137906555894;4945.975270123644;4958.256261560777;4971.577415919651;4979.456368525751;4982.9252561211615;4368.934465983013;4642.396488456496;4974.77613507393;4983.127952608279;4986.700797952134;4263;4276.422682937795;4277.315629499265;4280.464941882265;4288.142371525676;6361.332060133712;6530.93469065308;6630.469562434993;6638.73445062197;6643.40209381158;5914.4676979071655;5975.910361344583;5984.431479009487;6005.159277701126;6005.789797357115;5459.372172200208;5863.560232982501;7242.0223269858425;7268.636568171623;7305.926940730631;4803.975980120112;4810.254410566367;4810.879728006793;4828.179209534387;4834.830780922651;7688.6924523019015;7734.922650773477;7749.380049596019;7787;7816.72641457552;4710.929336059962;4837.975810120997;4859.659823812299;4871.3667223261455;4925.285833554186;3626.7279954003557;4162.604552567501;4932.136876046678;4934.210526315772;4983.651144419929;5766.385412084623;5837.328707198726;5933.199018132583;5967.224260846062;5980.73086711099;6452.7094581083975;6760.425363844129;7327.487075904635;7340;7345.265473452612;1711.79458464985;1725.852308215048;1726.9395571154948;1727.06738361286;1728.3086765293983;1008.1682611845257;1087.7280679830042;1125.836753670713;1133.8072527670315;1152.8962393384468;5153.6907785532985;5528.391876893538;6812.046313516112;6836.965815170893;6911.619860907698;7571.507851989603;7578.3179513842915;7588.165301816795;7594.088709354803;7601.049868766404;6655.367740064686;6712.597244165268;6948.895766563404;6955.965220173968;6976.93023069773;3536.9469457958153;3722.9203530976256;4044.676425885922;4045.0494133878515;4048;7288.890666640004;7954.960225198837;8026.678932842621;8039.236272554098;8044.195580442026;6752.291009444036;7496.887546686804;7566.546007239584;7923.603819808986;7941.245581669732;7905.130435652074;8051.758447246475;8056.919430805617;8057.274845263954;8063.556504392314;7576.545407275581;7621.961890190735;7622.199669034671;7646.923530764621;7675.808104797425;5961.731722072431;7476.70093196266;7478.70085196586;7490.213527579525;7500.737474188377;7721.575313357819;8019.599020048858;8031.718889838828;8055.798605034921;8119.918800811916;3875.8837234883;4716.528347165256;4753.572178503951;4754.762261886961;4774.737389443614;7650.579218142833;7661.659209638179;7662.540247585162;7680.039995000625;7695.57674327895;6718.764843230463;6803.353681400259;7399.334059934632;7404.222556631692;7442.7395041173295;6309.148264984168;7170.820729481805;7399.297066778648;7404.518706284074;7408.03695519579;7193.640317983975;7208.098987626547;7221.350078492961;7254.383377412979;7266;7339.926600733925;7345.228750981284;7350.375218106521;7359.374453171326;7370;7226.530275532074;7233.782986510413;7238.565686058853;7246.74636387745;7256.89114663291 04:50:28 INFO - PROCESS | 1949 | |5;yui.html;653.8561516466378;714.6641078693015;716.3874886971639;740.7777666699989;785.1559573458532;15038.398464061438;15173.544793656209;15332.15673137977;15475.84524154758;15487.612809679764;14178.078424902375;14192.36134373953;14197.78703319451;14233.074850134733;14273.286335683226;757.6742000939594;955.4028732042474;985.8373368394207;989.7080361293399;992.4045572656421;968.6803354892903;971.4317124482186;981.2640519610293;984.4733067808723;990.9702708918744;1019.7660830395193;1044.8589440425521;1048.3395460859647;1049.2445439283742;1050.6217761605815;1002.8495725641139;1006.7684432580547;1010.5048526222135;1013.7769690668041;1018.5874720738038;748.4573684079054;762.8207371267748;767.7197822794695;775.9806004849924;783.4006984656742;14845.109293442429;14958.027728197632;15002.24988750558;15006.849931500763;15011.624709382244;10435.530401131968;12836.294003829786;12913.225206487641;12943.158694684815;13006.739865202642;8510.787230319229;9935.503224838729;10008.699739007841;10233.283670143093;10308.690739277834;3568.1614820517157;3569.678728914384;3618.0412190769202;3651.2879988402274;3801.4297855321925;84080.57959710162;84459.15540844575;86762;86906.13093869107;87114;8616.48301101936;8803.735887923373;9700.320977531504;9730.464824434583;9889.950550247346;21836.45408864791;22418.327450176195;22518.887405562866;22650;22818.201362952215;7437.144728356308;7467.327940485274;7504.549727016287;7566.772996810105;7647.120581133129;4099.959000410017;4206;4217.599328063829;4218.346156345771;4224.619784219373;3753.9436908446396;3791.5071040764524;3804.2962052020466;3807.485989391452;3811.8475260989803;661.9900701489481;662.4766434516678;667.442685357722;678.4809620640215;696.5368030259922;567.5771550195132;580.7183515994739;604.7218279591349;609.6342194683155;610.9908351374733;7850.607469626496;8194.057683366489;8249.175082491824;8307.6676932922;8414.579271036424;532.2309263114762;582.2547139661241;597.2951916738203;600.4565867889567;617.5491890919564;3374.865005399806;3653.94519082214;3657.4330978698345;3868.709846761448;3879.670228030649;95907.52046239724;96168;96766;97277.51361243149;97306;76355.23644763482;77181.22818771741;80376;82135.91748045608;82533.58733206296;68766;69158.30841691619;71277.6436117816;72249.6387518059;74942.12644683926;7496.662650180864;7639.312461878235;7724.459287850022;7799.922000780147;7965.960170199112;46330.536694632625;46396;48057.519424806706;49174.50825491699;50861;60329.69835150796;68918;70562.64718676374;71163.57672846617;72148;10329.173666106844;10335.896641033794;10474.738131546468;10607.469626518798;10676;10718;10730.980556847087;10743.194260430342;11043.723906902393;11262.662120136409;10144.340617859816;10176.592936282466;10183.541740621542;10187.949060254949;10918.962698543626;9620.182284505896;9663.13031827139;9775.853362199716;9805.803883922139;9807;9820.263480239153;9895.802083958137;9905.900940990787;10033.14718248957;10650.946745266534;7761.650725717469;8124.593770311342;8205.671773129247;8267.793305167179;8787.25308348772;8465.407421480684;8485.448445851;8613.138686131588;8773.824523509622;8959.41763785352 04:50:28 INFO - PROCESS | 1949 | __end_tp_report 04:50:28 INFO - PROCESS | 1949 | __start_cc_report 04:50:28 INFO - PROCESS | 1949 | _x_x_mozilla_cycle_collect,363 04:50:28 INFO - PROCESS | 1949 | __end_cc_report 04:50:28 INFO - PROCESS | 1949 | __startTimestamp1460116228439__endTimestamp 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | ------- Summary: start ------- 04:50:28 INFO - PROCESS | 1949 | Number of tests: 6 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | [#0] dojo.html Cycles:165 Average:5804.49 Median:6103.60 stddev:664.76 (10.9%) stddev-sans-first:641.84 04:50:28 INFO - PROCESS | 1949 | Values: 3504.2 3538.7 3568.8 3592.7 3611.0 5705.4 5722.1 5738.7 5753.7 5760.0 5720.5 5720.7 5726.1 5753.0 5755.9 5169.0 5190.2 5216.3 5261.9 5266.2 4353.9 5185.1 5288.6 5327.7 5407.6 5293.7 5327.2 5327.6 5341.1 5355.9 5330.2 5338.9 5362.0 5362.4 5407.6 5119.8 5152.1 5200.8 5263.7 5278.0 4695.3 5583.4 5710.6 5725.2 5764.9 6250.3 6269.4 6274.1 6308.6 6321.2 5246.7 5594.7 6168.5 6239.9 6308.7 5884.5 5895.6 5904.3 5914.9 5916.4 5265.8 6395.0 6408.2 6415.7 6418.3 6109.9 6196.7 6243.9 6287.0 6326.7 6331.5 6335.4 6346.3 6354.5 6360.3 5250.9 6126.9 6283.3 6324.7 6355.4 6270.5 6300.0 6331.8 6336.4 6344.3 4938.9 4946.3 4973.6 4998.7 5012.0 4406.1 4428.3 4512.8 4519.3 4546.1 4394.3 5872.6 5899.0 5956.9 6103.6 6248.5 6277.4 6323.7 6329.6 6336.9 5784.0 5988.1 5988.6 5996.5 6005.2 5386.9 5434.5 5461.0 5473.9 5500.8 6463.4 6474.1 6483.6 6489.2 6507.1 6226.8 6251.4 6294.6 6321.6 6326.1 6444.1 6525.9 6532.0 6532.2 6546.9 6278.4 6291.0 6319.3 6322.9 6336.7 6265.8 6277.5 6293.6 6325.9 6338.1 6117.7 6204.9 6241.5 6249.8 6284.1 6069.2 6239.4 6244.7 6258.0 6262.5 5926.5 6104.1 6109.7 6116.0 6126.9 6174.7 6227.7 6239.3 6239.6 6263.2 6078.3 6087.6 6118.4 6121.6 6127.2 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | [#1] ext.html Cycles:180 Average:58937.32 Median:21216.02 stddev:116503.69 (549.1%) stddev-sans-first:116747.88 04:50:28 INFO - PROCESS | 1949 | Values: 496.4 593.8 614.2 631.5 678.8 37935.4 38505.4 38567.6 38595.0 38616.8 39459.4 39810.4 40231.6 40482.8 40508.4 9392.2 9554.0 9612.6 9639.3 9740.6 7903.4 9132.8 9604.4 9705.4 9728.3 8840.2 9743.0 9783.9 9785.5 9814.0 9678.3 9725.1 9749.0 9768.2 9806.9 9596.0 9680.4 9724.0 9730.7 9737.6 34354.5 39554.0 40300.2 40795.0 40954.0 2743.9 3259.0 3273.3 3478.0 3857.4 26986.9 27037.9 27080.0 27207.0 27415.0 2696.3 2769.4 2803.7 2836.4 2905.1 361822.0 388881.0 396859.0 399221.0 402650.0 49126.0 49156.0 49587.3 68015.3 68369.7 49495.3 50380.5 50653.0 50747.0 50785.0 17253.8 17465.5 17651.2 17679.0 17688.8 13748.9 13956.7 13993.8 14019.0 14065.1 15571.3 15595.0 15720.8 15758.1 15789.9 5592.9 6060.8 6202.3 6639.0 6669.1 993.9 1057.3 1064.6 1132.6 1149.9 22698.0 29392.3 29692.1 29904.9 30326.2 1136.9 1145.9 1159.1 1169.4 1257.2 15283.5 15362.5 15436.5 15491.5 15690.4 461110.0 462077.0 464634.0 467165.0 469027.0 60643.7 61389.1 61460.7 61922.0 62095.7 1535.8 1550.4 1553.7 1565.5 1580.8 25124.0 29286.7 30175.0 30583.7 30761.2 53439.5 53691.2 53951.7 54117.5 54195.7 452195.0 460222.0 462231.0 462412.0 465629.0 32936.8 34255.5 34865.0 35209.3 35480.0 46480.8 47058.8 47301.5 47313.0 48103.8 37580.4 37901.1 38444.4 38579.0 39094.0 37194.3 37443.3 37619.4 37965.8 38574.7 31729.4 37803.8 38051.8 38431.4 38528.6 33149.8 33173.3 33279.3 33582.5 33937.8 25599.9 25890.6 25917.2 26098.3 26192.9 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | [#2] jquery.html Cycles:180 Average:33071.99 Median:11636.23 stddev:89522.39 (769.3%) stddev-sans-first:89739.85 04:50:28 INFO - PROCESS | 1949 | Values: 372.3 377.2 380.0 381.7 388.4 19827.5 20297.9 20551.4 20993.5 21062.3 10530.9 11838.3 12353.1 12392.0 12470.3 5205.7 5555.6 5994.3 5994.9 6009.2 5867.0 5984.9 5988.0 6031.3 6032.6 5535.6 5779.6 5782.2 5793.2 5905.2 5712.8 5731.0 5758.4 6263.7 6703.4 5751.6 5871.4 5903.4 5916.5 5919.7 13876.0 19602.0 20041.4 26191.9 26750.1 2087.1 2101.3 2166.0 2167.9 2650.4 9689.8 10068.2 10176.4 10206.4 10485.6 1766.4 1849.2 1880.9 1968.5 1996.3 105069.8 110522.0 113853.4 124760.0 126524.4 19594.9 19839.9 20160.4 20272.0 20517.1 30295.7 31113.2 31295.8 31564.7 31734.0 11311.8 11332.9 11498.9 11644.8 11808.0 9671.8 9791.3 9839.6 9876.0 9916.5 8941.5 9094.0 9173.6 9174.8 9198.0 3100.3 3517.1 3550.2 3579.4 3692.5 884.1 945.1 969.7 1065.9 1118.8 16961.7 20311.0 20518.5 21028.6 21106.5 847.6 990.8 1007.4 1010.6 1012.1 11042.9 11131.7 11243.0 11876.9 12053.0 464725.0 469140.0 469246.0 621299.6 627905.0 87285.0 118536.0 118722.0 120718.4 121245.2 1030.3 1044.9 1046.0 1061.6 1076.6 18231.0 18318.8 18491.4 18542.7 18622.3 39056.8 42237.8 50684.0 51426.7 51673.0 70447.0 72012.0 74394.5 75584.6 77250.8 7952.1 8105.6 8150.3 8228.1 8477.9 9489.7 13035.7 13116.5 13398.8 13489.9 9333.8 10292.4 10672.4 10709.5 11612.6 10839.6 10977.8 11274.9 11494.7 11622.8 11489.8 11727.7 11807.9 11914.4 12043.0 8130.8 8192.9 8218.0 8270.9 8345.4 10499.7 11214.4 11595.7 11621.2 11669.4 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | [#3] mootools.html Cycles:180 Average:6192.94 Median:5066.75 stddev:3208.01 (63.3%) stddev-sans-first:3196.60 04:50:28 INFO - PROCESS | 1949 | Values: 1378.5 1618.3 1767.8 1872.2 2021.8 8120.6 8776.9 8837.8 9040.1 9063.0 8879.7 8901.9 8961.6 8967.6 8970.3 2551.0 2578.0 2584.8 2585.3 2590.3 2514.8 2539.9 2547.9 2559.7 2560.4 2491.8 2507.2 2508.8 2537.3 2551.0 2542.3 2556.4 2569.3 2586.1 2595.3 2517.7 2540.3 2541.2 2554.6 2559.1 8866.2 8979.3 8995.3 9024.7 9035.8 5548.9 5635.0 5662.2 5673.3 5684.2 3562.5 3649.7 3697.1 3711.1 3725.6 1063.6 1066.5 1078.8 1079.4 1081.9 11916.7 12042.9 12191.9 12245.3 12273.3 4933.5 5024.7 5028.7 5074.6 5115.7 9358.9 9933.0 10397.4 10408.3 10464.5 5523.0 5638.7 5639.2 5667.0 5680.7 4473.0 4528.9 4897.3 5003.7 5058.8 4093.6 4104.5 4112.4 4120.4 4148.2 1329.5 1366.7 1369.1 1372.9 1377.6 1370.2 1396.8 1418.5 1443.5 1449.5 8320.3 8539.4 8600.2 8605.3 8614.1 1264.4 1270.8 1270.9 1279.5 1301.5 5090.5 6320.8 6401.5 6414.7 6487.7 10362.9 10653.5 10714.0 10779.6 10804.7 10392.3 10698.6 10745.4 10777.8 10851.2 8421.4 8541.4 8582.5 8591.2 8623.9 7843.3 8093.2 8127.3 8147.5 8177.8 9549.8 9734.7 9748.2 9801.8 9912.0 10032.4 10092.6 10143.0 10232.6 10262.1 6155.8 7633.8 7694.9 7768.6 7771.7 8156.1 8246.8 8287.0 8301.9 8337.6 7283.3 7465.0 7471.9 7485.7 7551.0 7364.2 7423.4 7434.7 7505.4 7523.4 7873.2 7907.5 7939.6 7986.0 7999.1 7127.6 7168.0 7182.8 7234.3 7277.7 7194.5 7217.2 7251.2 7258.3 7266.7 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | [#4] prototype.html Cycles:180 Average:5926.14 Median:6715.68 stddev:1941.32 (28.9%) stddev-sans-first:1900.83 04:50:28 INFO - PROCESS | 1949 | Values: 332.9 334.3 338.9 342.6 343.7 6330.7 6750.9 6752.8 6778.4 6804.8 6697.0 6751.2 6775.2 6780.3 6790.8 4759.2 4858.7 4939.9 4963.4 5005.5 3964.7 4019.4 4931.3 4939.1 5071.1 4946.0 4958.3 4971.6 4979.5 4982.9 4368.9 4642.4 4974.8 4983.1 4986.7 4263.0 4276.4 4277.3 4280.5 4288.1 6361.3 6530.9 6630.5 6638.7 6643.4 5914.5 5975.9 5984.4 6005.2 6005.8 5459.4 5863.6 7242.0 7268.6 7305.9 4804.0 4810.3 4810.9 4828.2 4834.8 7688.7 7734.9 7749.4 7787.0 7816.7 4710.9 4838.0 4859.7 4871.4 4925.3 3626.7 4162.6 4932.1 4934.2 4983.7 5766.4 5837.3 5933.2 5967.2 5980.7 6452.7 6760.4 7327.5 7340.0 7345.3 1711.8 1725.9 1726.9 1727.1 1728.3 1008.2 1087.7 1125.8 1133.8 1152.9 5153.7 5528.4 6812.0 6837.0 6911.6 7571.5 7578.3 7588.2 7594.1 7601.0 6655.4 6712.6 6948.9 6956.0 6976.9 3536.9 3722.9 4044.7 4045.0 4048.0 7288.9 7955.0 8026.7 8039.2 8044.2 6752.3 7496.9 7566.5 7923.6 7941.2 7905.1 8051.8 8056.9 8057.3 8063.6 7576.5 7622.0 7622.2 7646.9 7675.8 5961.7 7476.7 7478.7 7490.2 7500.7 7721.6 8019.6 8031.7 8055.8 8119.9 3875.9 4716.5 4753.6 4754.8 4774.7 7650.6 7661.7 7662.5 7680.0 7695.6 6718.8 6803.4 7399.3 7404.2 7442.7 6309.1 7170.8 7399.3 7404.5 7408.0 7193.6 7208.1 7221.4 7254.4 7266.0 7339.9 7345.2 7350.4 7359.4 7370.0 7226.5 7233.8 7238.6 7246.7 7256.9 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - PROCESS | 1949 | [#5] yui.html Cycles:180 Average:18425.26 Median:635.70 stddev:26649.54 (4192.1%) stddev-sans-first:26690.89 04:50:28 INFO - PROCESS | 1949 | Values: 653.9 714.7 716.4 740.8 785.2 15038.4 15173.5 15332.2 15475.8 15487.6 14178.1 14192.4 14197.8 14233.1 14273.3 757.7 955.4 985.8 989.7 992.4 968.7 971.4 981.3 984.5 991.0 1019.8 1044.9 1048.3 1049.2 1050.6 1002.8 1006.8 1010.5 1013.8 1018.6 748.5 762.8 767.7 776.0 783.4 14845.1 14958.0 15002.2 15006.8 15011.6 10435.5 12836.3 12913.2 12943.2 13006.7 8510.8 9935.5 10008.7 10233.3 10308.7 3568.2 3569.7 3618.0 3651.3 3801.4 84080.6 84459.2 86762.0 86906.1 87114.0 8616.5 8803.7 9700.3 9730.5 9890.0 21836.5 22418.3 22518.9 22650.0 22818.2 7437.1 7467.3 7504.5 7566.8 7647.1 4100.0 4206.0 4217.6 4218.3 4224.6 3753.9 3791.5 3804.3 3807.5 3811.8 662.0 662.5 667.4 678.5 696.5 567.6 580.7 604.7 609.6 611.0 7850.6 8194.1 8249.2 8307.7 8414.6 532.2 582.3 597.3 600.5 617.5 3374.9 3653.9 3657.4 3868.7 3879.7 95907.5 96168.0 96766.0 97277.5 97306.0 76355.2 77181.2 80376.0 82135.9 82533.6 68766.0 69158.3 71277.6 72249.6 74942.1 7496.7 7639.3 7724.5 7799.9 7966.0 46330.5 46396.0 48057.5 49174.5 50861.0 60329.7 68918.0 70562.6 71163.6 72148.0 10329.2 10335.9 10474.7 10607.5 10676.0 10718.0 10731.0 10743.2 11043.7 11262.7 10144.3 10176.6 10183.5 10187.9 10919.0 9620.2 9663.1 9775.9 9805.8 9807.0 9820.3 9895.8 9905.9 10033.1 10650.9 7761.7 8124.6 8205.7 8267.8 8787.3 8465.4 8485.4 8613.1 8773.8 8959.4 04:50:28 INFO - PROCESS | 1949 | -------- Summary: end -------- 04:50:28 INFO - PROCESS | 1949 | 04:50:28 INFO - TEST-INFO | 1949: exit 0 04:50:28 INFO - TEST-OK | dromaeo_css | took 1109864ms 04:50:28 INFO - TEST-START | kraken 04:50:28 INFO - operating with platform_type : mac_ 04:50:28 INFO - Initialising browser for kraken test... 04:50:28 INFO - TEST-INFO | started process 1954 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/tmpYwP_gi/profile http://localhost:51439/getInfo.html) 04:50:31 INFO - PROCESS | 1954 | __metrics Screen width/height:1600/1200 04:50:31 INFO - PROCESS | 1954 | colorDepth:24 04:50:31 INFO - PROCESS | 1954 | Browser inner width/height: 1024/689 04:50:31 INFO - PROCESS | 1954 | __metrics 04:50:31 ERROR - PROCESS | 1954 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 04:50:32 INFO - TEST-INFO | 1954: exit 0 04:50:32 INFO - Browser initialized. 04:50:32 INFO - Running cycle 1/1 for kraken test... 04:50:32 INFO - TEST-INFO | started process 1957 (/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/tmpYwP_gi/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:50:44 INFO - PROCESS | 1957 | RSS: Main: 217595904 04:50:44 INFO - PROCESS | 1957 | 04:50:46 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51439/tests/kraken/driver.html?testName=audio-beat-detection) 04:50:47 INFO - PROCESS | 1957 | RSS: Main: 229613568 04:50:47 INFO - PROCESS | 1957 | 04:50:50 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51439/tests/kraken/driver.html?testName=audio-dft) 04:50:50 INFO - PROCESS | 1957 | RSS: Main: 239144960 04:50:50 INFO - PROCESS | 1957 | 04:50:54 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51439/tests/kraken/driver.html?testName=audio-fft) 04:50:54 INFO - PROCESS | 1957 | RSS: Main: 242708480 04:50:54 INFO - PROCESS | 1957 | 04:50:56 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51439/tests/kraken/driver.html?testName=audio-oscillator) 04:50:57 INFO - PROCESS | 1957 | RSS: Main: 243912704 04:50:57 INFO - PROCESS | 1957 | 04:50:59 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51439/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:50:59 INFO - PROCESS | 1957 | RSS: Main: 244199424 04:50:59 INFO - PROCESS | 1957 | 04:51:02 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51439/tests/kraken/driver.html?testName=imaging-darkroom) 04:51:03 INFO - PROCESS | 1957 | RSS: Main: 244011008 04:51:03 INFO - PROCESS | 1957 | 04:51:06 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51439/tests/kraken/driver.html?testName=imaging-desaturate) 04:51:06 INFO - PROCESS | 1957 | RSS: Main: 243961856 04:51:06 INFO - PROCESS | 1957 | 04:51:09 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51439/tests/kraken/driver.html?testName=json-parse-financial) 04:51:10 INFO - PROCESS | 1957 | RSS: Main: 244539392 04:51:10 INFO - PROCESS | 1957 | 04:51:12 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51439/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:51:12 INFO - PROCESS | 1957 | RSS: Main: 243892224 04:51:12 INFO - PROCESS | 1957 | 04:51:14 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51439/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:51:15 INFO - PROCESS | 1957 | RSS: Main: 244244480 04:51:15 INFO - PROCESS | 1957 | 04:51:17 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51439/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:51:17 INFO - PROCESS | 1957 | RSS: Main: 244989952 04:51:17 INFO - PROCESS | 1957 | 04:51:20 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51439/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:51:21 INFO - PROCESS | 1957 | RSS: Main: 244838400 04:51:21 INFO - PROCESS | 1957 | 04:51:23 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51439/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:51:24 INFO - PROCESS | 1957 | RSS: Main: 244281344 04:51:24 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | Cycle 1(1): loaded http://localhost:51439/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51439/tests/kraken/driver.html?testName=ai-astar) 04:51:25 INFO - PROCESS | 1957 | RSS: Main: 246427648 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | __start_tp_report 04:51:25 INFO - PROCESS | 1957 | _x_x_mozilla_page_load 04:51:25 INFO - PROCESS | 1957 | _x_x_mozilla_page_load_details 04:51:25 INFO - PROCESS | 1957 | |i|pagename|runs| 04:51:25 INFO - PROCESS | 1957 | |0;ai-astar;129;95;138;172;174;127;112;93;170;104 04:51:25 INFO - PROCESS | 1957 | |1;audio-beat-detection;154;120;179;168;120;143;121;152;149;119 04:51:25 INFO - PROCESS | 1957 | |2;audio-dft;191;199;196;200;197;195;195;197;196;197 04:51:25 INFO - PROCESS | 1957 | |3;audio-fft;70;70;92;149;84;74;57;58;117;60 04:51:25 INFO - PROCESS | 1957 | |4;audio-oscillator;86;116;143;81;80;82;120;80;81;120 04:51:25 INFO - PROCESS | 1957 | |5;imaging-gaussian-blur;89;87;90;88;99;132;77;132;135;129 04:51:25 INFO - PROCESS | 1957 | |6;imaging-darkroom;94;95;95;95;94;94;94;95;93;95 04:51:25 INFO - PROCESS | 1957 | |7;imaging-desaturate;139;153;89;100;129;94;119;148;92;91 04:51:25 INFO - PROCESS | 1957 | |8;json-parse-financial;53;59;58;60;53;56;55;74;72;86 04:51:25 INFO - PROCESS | 1957 | |9;json-stringify-tinderbox;62;65;70;67;68;73;70;67;77;101 04:51:25 INFO - PROCESS | 1957 | |10;stanford-crypto-aes;82;85;84;83;84;81;83;84;84;87 04:51:25 INFO - PROCESS | 1957 | |11;stanford-crypto-ccm;124;133;116;130;135;151;138;119;120;128 04:51:25 INFO - PROCESS | 1957 | |12;stanford-crypto-pbkdf2;125;134;139;135;134;126;139;134;138;133 04:51:25 INFO - PROCESS | 1957 | |13;stanford-crypto-sha256-iterative;67;69;65;67;65;64;66;67;65;68 04:51:25 INFO - PROCESS | 1957 | __end_tp_report 04:51:25 INFO - PROCESS | 1957 | __start_cc_report 04:51:25 INFO - PROCESS | 1957 | _x_x_mozilla_cycle_collect,946 04:51:25 INFO - PROCESS | 1957 | __end_cc_report 04:51:25 INFO - PROCESS | 1957 | __startTimestamp1460116285949__endTimestamp 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | ------- Summary: start ------- 04:51:25 INFO - PROCESS | 1957 | Number of tests: 14 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#0] ai-astar Cycles:10 Average:131.40 Median:171.00 stddev:31.53 (18.4%) stddev-sans-first:33.43 04:51:25 INFO - PROCESS | 1957 | Values: 129.0 95.0 138.0 172.0 174.0 127.0 112.0 93.0 170.0 104.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#1] audio-beat-detection Cycles:10 Average:142.50 Median:150.50 stddev:21.79 (14.5%) stddev-sans-first:22.71 04:51:25 INFO - PROCESS | 1957 | Values: 154.0 120.0 179.0 168.0 120.0 143.0 121.0 152.0 149.0 119.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#2] audio-dft Cycles:10 Average:196.30 Median:197.00 stddev:2.45 (1.2%) stddev-sans-first:1.69 04:51:25 INFO - PROCESS | 1957 | Values: 191.0 199.0 196.0 200.0 197.0 195.0 195.0 197.0 196.0 197.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#3] audio-fft Cycles:10 Average:83.10 Median:70.00 stddev:29.52 (42.2%) stddev-sans-first:30.93 04:51:25 INFO - PROCESS | 1957 | Values: 70.0 70.0 92.0 149.0 84.0 74.0 57.0 58.0 117.0 60.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#4] audio-oscillator Cycles:10 Average:98.90 Median:80.50 stddev:23.42 (29.1%) stddev-sans-first:24.37 04:51:25 INFO - PROCESS | 1957 | Values: 86.0 116.0 143.0 81.0 80.0 82.0 120.0 80.0 81.0 120.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#5] imaging-gaussian-blur Cycles:10 Average:105.80 Median:87.50 stddev:23.19 (26.5%) stddev-sans-first:23.79 04:51:25 INFO - PROCESS | 1957 | Values: 89.0 87.0 90.0 88.0 99.0 132.0 77.0 132.0 135.0 129.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#6] imaging-darkroom Cycles:10 Average:94.40 Median:95.00 stddev:0.70 (0.7%) stddev-sans-first:0.73 04:51:25 INFO - PROCESS | 1957 | Values: 94.0 95.0 95.0 95.0 94.0 94.0 94.0 95.0 93.0 95.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#7] imaging-desaturate Cycles:10 Average:115.40 Median:121.00 stddev:25.31 (20.9%) stddev-sans-first:25.37 04:51:25 INFO - PROCESS | 1957 | Values: 139.0 153.0 89.0 100.0 129.0 94.0 119.0 148.0 92.0 91.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#8] json-parse-financial Cycles:10 Average:62.60 Median:59.50 stddev:11.02 (18.5%) stddev-sans-first:11.12 04:51:25 INFO - PROCESS | 1957 | Values: 53.0 59.0 58.0 60.0 53.0 56.0 55.0 74.0 72.0 86.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#9] json-stringify-tinderbox Cycles:10 Average:72.00 Median:69.00 stddev:11.01 (15.9%) stddev-sans-first:11.06 04:51:25 INFO - PROCESS | 1957 | Values: 62.0 65.0 70.0 67.0 68.0 73.0 70.0 67.0 77.0 101.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#10] stanford-crypto-aes Cycles:10 Average:83.70 Median:84.00 stddev:1.64 (1.9%) stddev-sans-first:1.62 04:51:25 INFO - PROCESS | 1957 | Values: 82.0 85.0 84.0 83.0 84.0 81.0 83.0 84.0 84.0 87.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#11] stanford-crypto-ccm Cycles:10 Average:129.40 Median:131.50 stddev:10.50 (8.0%) stddev-sans-first:10.95 04:51:25 INFO - PROCESS | 1957 | Values: 124.0 133.0 116.0 130.0 135.0 151.0 138.0 119.0 120.0 128.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:133.70 Median:134.50 stddev:4.85 (3.6%) stddev-sans-first:4.00 04:51:25 INFO - PROCESS | 1957 | Values: 125.0 134.0 139.0 135.0 134.0 126.0 139.0 134.0 138.0 133.0 04:51:25 INFO - PROCESS | 1957 | 04:51:25 INFO - PROCESS | 1957 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.30 Median:67.00 stddev:1.57 (2.3%) stddev-sans-first:1.64 04:51:25 INFO - PROCESS | 1957 | Values: 67.0 69.0 65.0 67.0 65.0 64.0 66.0 67.0 65.0 68.0 04:51:25 INFO - PROCESS | 1957 | -------- Summary: end -------- 04:51:25 INFO - PROCESS | 1957 | 04:51:26 INFO - TEST-INFO | 1957: exit 0 04:51:26 INFO - TEST-OK | kraken | took 57733ms 04:51:26 INFO - SUITE-END | took 1167s 04:51:27 INFO - Completed test suite (00:19:27) 04:51:27 INFO - javascript benchmark 04:51:27 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3504.229069604687, 3538.699210567101, 3568.8044505090793, 3592.73054520911, 3610.963890361097, 5705.4294570542925, 5722.113072473768, 5738.713064346782, 5753.685923840042, 5759.971200143998, 5720.542356611471, 5720.742566584503, 5726.055200891848, 5753.021986262335, 5755.913661295084, 5169.0, 5190.195519694454, 5216.321878155834, 5261.894762104775, 5266.157414813631, 4353.934690979622, 5185.144451165553, 5288.629795914288, 5327.733613319338, 5407.567394608442, 5293.655912365703, 5327.200919862033, 5327.573794096483, 5341.1187154119525, 5355.919661205085, 5330.227117068042, 5338.866528336784, 5362.0, 5362.43694412085, 5407.621466497347, 5119.769610367543, 5152.072626927152, 5200.843974680765, 5263.657862238981, 5278.0, 4695.295705644146, 5583.3858275589655, 5710.628809127394, 5725.227094342252, 5764.933487304862, 6250.343713910065, 6269.3730626937395, 6274.058891166316, 6308.558400911938, 6321.209848768904, 5246.685198888041, 5594.748236329375, 6168.475679567242, 6239.87520249597, 6308.684565771739, 5884.47039766423, 5895.587308888379, 5904.3210030847, 5914.852128696774, 5916.4379383958885, 5265.815696450606, 6395.0, 6408.198975128109, 6415.722418541351, 6418.326075761977, 6109.908351374733, 6196.659183744938, 6243.906341404882, 6287.0, 6326.715297811609, 6331.461825744863, 6335.366463353628, 6346.30190679025, 6354.523410744213, 6360.268569114519, 5250.868728281824, 6126.853582554517, 6283.277423096311, 6324.6521441321165, 6355.396237357536, 6270.467010304084, 6299.96850015747, 6331.778387756406, 6336.429721325103, 6344.333844946306, 4938.851834444972, 4946.332245146859, 4973.5523802857915, 4998.700077995332, 5012.0, 4406.1187762447, 4428.33574963758, 4512.842050528216, 4519.322101684774, 4546.136234115507, 4394.252976993918, 5872.588918775645, 5898.970505147533, 5956.8808623828145, 6103.6032657877095, 6248.5313601479165, 6277.403646653561, 6323.715432805535, 6329.588576742497, 6336.873262534724, 5783.971080144573, 5988.071848863433, 5988.550858685616, 5996.4603185713495, 6005.189299444606, 5386.91919621206, 5434.538064264581, 5460.972695136499, 5473.890522189534, 5500.834974950758, 6463.418292353711, 6474.061261117112, 6483.610983341015, 6489.156409666713, 6507.056476810931, 6226.782062627786, 6251.374862513712, 6294.590851594632, 6321.589096708699, 6326.082718005771, 6444.097826304227, 6525.8694826104165, 6531.967340163269, 6532.150820393318, 6546.934530654823, 6278.434940855345, 6291.0, 6319.304876463677, 6322.905156422749, 6336.651484168415, 6265.8120256392385, 6277.497800176066, 6293.622382657055, 6325.936740632719, 6338.080978258219, 6117.724702388314, 6204.875902482016, 6241.500679945684, 6249.7500099997305, 6284.057391391328, 6069.241344831896, 6239.438450539473, 6244.718987645476, 6258.0, 6262.53031022666, 5926.496247818984, 6104.114903338902, 6109.694515274307, 6115.969420153048, 6126.877462450637, 6174.703312304287, 6227.719752611234, 6239.344868788712, 6239.594426362272, 6263.185785847811, 6078.270607527125, 6087.57386982907, 6118.418750218722, 6121.632702037892, 6127.172831667668], "unit": "score", "name": "dojo.html", "value": 5764.626627489736}, {"lowerIsBetter": false, "replicates": [496.40859596338873, 593.8040446652606, 614.2046050364778, 631.4758750237304, 678.8357966088158, 37935.43096853546, 38505.42241866367, 38567.61432385675, 38595.0, 38616.80691596542, 39459.40810887839, 39810.402843957294, 40231.59768402315, 40482.7975860121, 40508.39237411434, 9392.248620110391, 9554.0, 9612.567434465465, 9639.277054220927, 9740.561674724619, 7903.40724445666, 9132.771680707969, 9604.423734575912, 9705.369151005198, 9728.270379721549, 8840.248578870804, 9742.976987416325, 9783.853242201372, 9785.510724463784, 9814.018598140201, 9678.274129440286, 9725.0761177688, 9748.976357482468, 9768.169705575, 9806.90193098067, 9595.992420795787, 9680.370775899544, 9723.951380243125, 9730.708078757649, 9737.610495580167, 34354.48468272978, 39554.0, 40300.19399612021, 40795.0, 40954.0, 2743.931401714953, 3258.96741032589, 3273.29624130813, 3477.9840426590254, 3857.3635350167187, 26986.86506567474, 27037.864810676016, 27080.0, 27207.0, 27415.0, 2696.28548434665, 2769.3907340385085, 2803.6635603727477, 2836.390176112125, 2905.0848982570633, 361822.0, 388881.0, 396859.0314096822, 399221.0, 402650.0, 49126.0, 49155.99999999929, 49587.25619115716, 68015.31984680188, 68369.65815170892, 49495.25757113646, 50380.496195038315, 50653.0, 50747.0, 50784.98430031379, 17253.827461725472, 17465.476035718948, 17651.205695743465, 17679.0, 17688.823111768976, 13748.93125534366, 13956.72086558263, 13993.790093148611, 14019.0, 14065.085769424955, 15571.299291531908, 15594.986325888782, 15720.842791571939, 15758.133302668462, 15789.894707370604, 5592.944070559323, 6060.818175454743, 6202.2867370253, 6638.96680516604, 6669.1330127083165, 993.8608594796734, 1057.2704833664748, 1064.5954537275786, 1132.5866058888446, 1149.9022583080532, 22698.0, 29392.26519337034, 29692.109236722932, 29904.85047574748, 30326.241843953638, 1136.9147313951487, 1145.9484323205477, 1159.13644334971, 1169.3919162035863, 1257.2456526084459, 15283.515957128351, 15362.539123826304, 15436.536903892902, 15491.5352539424, 15690.372385104696, 461110.0, 462077.0, 464634.0, 467165.0, 469027.0, 60643.69678151581, 61389.07916381258, 61460.692696537124, 61922.0, 62095.6895215521, 1535.7619568966827, 1550.4340915565738, 1553.712563175816, 1565.4833904811385, 1580.8498192671677, 25124.0, 29286.707132928397, 30175.0, 30583.694163058084, 30761.230969225948, 53439.465605345, 53691.194632079765, 53951.730241348545, 54117.45882541282, 54195.729021354644, 452195.0, 460222.0, 462231.0, 462412.0, 465629.0, 32936.84721034752, 34255.486167708004, 34865.0, 35209.295814084086, 35480.0, 46480.767596163154, 47058.76470617625, 47301.52698473109, 47313.0, 48103.75948120237, 37580.436293456165, 37901.05247368838, 38444.42333365058, 38579.0, 39094.0, 37194.27366153514, 37443.25113497769, 37619.43570846385, 37965.81017094897, 38574.68551886896, 31729.365412692077, 37803.810980944916, 38051.80974095112, 38431.423528646534, 38528.614713853625, 33149.834250829554, 33173.336533269685, 33279.334413312085, 33582.49626255657, 33937.83031084829, 25599.872000639876, 25890.61164082578, 25917.22248332553, 26098.34754131086, 26192.8690356547], "unit": "score", "name": "ext.html", "value": 19484.595789536914}, {"lowerIsBetter": false, "replicates": [372.3000758573881, 377.23797928185064, 380.0233400161585, 381.7099004756386, 388.40573921899505, 19827.504312392197, 20297.898510507446, 20551.38345849623, 20993.47516312093, 21062.262820801257, 10530.946905309465, 11838.289702617827, 12353.07351948603, 12392.0, 12470.251784892913, 5205.713685747282, 5555.638883472561, 5994.280686317648, 5994.910076348859, 6009.218801555813, 5866.970665146669, 5984.910226346608, 5987.970060149693, 6031.306399764039, 6032.577719559633, 5535.58483113766, 5779.566532510057, 5782.24830771999, 5793.217915581385, 5905.173275741399, 5712.828615141531, 5730.968425683396, 5758.424157584229, 6263.71813268404, 6703.430208432289, 5751.626144300607, 5871.3541510433815, 5903.439173278532, 5916.4675179233645, 5919.733611987471, 13876.0, 19602.0, 20041.39875803728, 26191.869040654867, 26750.063747768734, 2087.1025459052603, 2101.3275751759443, 2165.9783402165936, 2167.934961951144, 2650.3639126609473, 9689.806203875953, 10068.244881633907, 10176.389416635026, 10206.387616742944, 10485.58057677692, 1766.4082532351676, 1849.1586328220628, 1880.9059547022594, 1968.468513501361, 1996.2913165826212, 105069.84790456298, 110522.0, 113853.43073284664, 124759.9999999991, 126524.36737816253, 19594.90202548978, 19839.908805015864, 20160.39518814438, 20271.986400679907, 20517.076731547117, 30295.697043029286, 31113.222169445493, 31295.84352078225, 31564.684353156634, 31734.04797856068, 11311.773764524663, 11332.943335283271, 11498.94250528742, 11644.76710465786, 11808.0, 9671.806563868684, 9791.265655075898, 9839.606415743434, 9876.012398760067, 9916.454594997344, 8941.508217047995, 9094.0, 9173.58718857653, 9174.770630734285, 9198.034206408365, 3100.3179300553843, 3517.120719820045, 3550.183457804668, 3579.409397449444, 3692.507557398799, 884.1070518776082, 945.1352012908112, 969.7042402067297, 1065.9467026648636, 1118.7650593375483, 16961.745573816403, 20310.984450777403, 20518.487037824172, 21028.579428411347, 21106.472338191666, 847.6100993542916, 990.7968866382374, 1007.3754272351189, 1010.5604062232952, 1012.1396812709138, 11042.889571104346, 11131.72170695739, 11243.044341230923, 11876.940615296868, 12053.0, 464725.0, 469140.0, 469246.0, 621299.5740085264, 627905.0, 87285.0, 118536.0, 118722.0, 120718.3964080174, 121245.18132228023, 1030.2685093583489, 1044.9059584637419, 1045.994770026145, 1061.5541472581535, 1076.6339444588878, 18231.0, 18318.777292576313, 18491.44525664232, 18542.721859171852, 18622.255109795457, 39056.804715976235, 42237.78881105575, 50684.0, 51426.74286628543, 51673.0, 70447.0, 72012.0, 74394.51210975858, 75584.62207688927, 77250.84123738261, 7952.125266220595, 8105.635246414044, 8150.26647601695, 8228.136045715113, 8477.915220847959, 9489.715308540755, 13035.674108147372, 13116.475340986253, 13398.799018014932, 13489.865101349253, 9333.766655833659, 10292.433916134685, 10672.413017284123, 10709.464526773474, 11612.593559225386, 10839.620613278497, 10977.780444391226, 11274.943625281821, 11494.655160345203, 11622.76754464889, 11489.82765258505, 11727.706807329543, 11807.881921180679, 11914.404279785802, 12043.0, 8130.75607731769, 8192.918070819216, 8217.972753405824, 8270.917290827014, 8345.41582089248, 10499.737506562396, 11214.439278036229, 11595.652130436101, 11621.186516943733, 11669.35818529989], "unit": "score", "name": "jquery.html", "value": 10176.900363828732}, {"lowerIsBetter": false, "replicates": [1378.510628726802, 1618.3364820423626, 1767.780231640169, 1872.2136702584912, 2021.807928246817, 8120.5939703014765, 8776.868346974801, 8837.823243535126, 9040.050794666557, 9063.003069662333, 8879.733607991771, 8901.910980890205, 8961.641534338618, 8967.596458159382, 8970.3272254581, 2550.9744902551015, 2577.9742202578013, 2584.8061395395325, 2585.31489155374, 2590.261775394013, 2514.8113891458124, 2539.923802285925, 2547.9490410191784, 2559.6800399950007, 2560.359910022494, 2491.7632824881607, 2507.1726330311044, 2508.761667641571, 2537.3276081838326, 2551.0, 2542.3389918621106, 2556.3736884463237, 2569.3448170716442, 2586.0690151545427, 2595.260350800032, 2517.672702548657, 2540.276021333911, 2541.1995221505167, 2554.604036374365, 2559.1298958354064, 8866.157715017063, 8979.281657467387, 8995.32535059873, 9024.729258122266, 9035.819283614292, 5548.91676624851, 5634.9857025735355, 5662.150677398382, 5673.319201695782, 5684.204211410406, 3562.5012498250267, 3649.6715295623258, 3697.0572504011307, 3711.109333759905, 3725.6460636239512, 1063.6117816996818, 1066.5049846435247, 1078.8381742738652, 1079.4063265204186, 1081.853949716786, 11916.702082447922, 12042.879571204263, 12191.939040304831, 12245.326507042199, 12273.324967126804, 4933.50664933511, 5024.698518088926, 5028.673136246132, 5074.644774865724, 5115.7442127893455, 9358.859617105749, 9933.00669933001, 10397.376157430426, 10408.323458975143, 10464.476776161162, 5522.950639378505, 5638.718064096779, 5639.154126881001, 5667.008273552195, 5680.6591604503865, 4472.955270447319, 4528.932066019012, 4897.338859253955, 5003.749812509433, 5058.848234552969, 4093.640148587693, 4104.52797928242, 4112.403701463271, 4120.381942708617, 4148.170365926827, 1329.5413082486527, 1366.7334869700512, 1369.1169195868808, 1372.9038967272195, 1377.6004958562105, 1370.2189751841554, 1396.818413606245, 1418.5318844781198, 1443.501991812823, 1449.4709431057588, 8320.334373250125, 8539.444936079135, 8600.182982616641, 8605.311575074104, 8614.05245423003, 1264.4436447962867, 1270.7649084919135, 1270.8602053774077, 1279.500994612102, 1301.4533895763614, 5090.490950904954, 6320.810375688737, 6401.487880969511, 6414.711337989802, 6487.740490380332, 10362.896371036344, 10653.467326633638, 10714.0, 10779.568817247378, 10804.729881753019, 10392.272540922215, 10698.625548105934, 10745.409002504937, 10777.83833242502, 10851.186161037796, 8421.368397370221, 8541.359398045171, 8582.485050896841, 8591.183837535424, 8623.913760862437, 7843.294103530709, 8093.150219227132, 8127.349812014906, 8147.470414423044, 8177.836443271221, 9549.809003820024, 9734.707958761248, 9748.22014238845, 9801.803963920824, 9912.0, 10032.398056116657, 10092.596296148073, 10143.0, 10232.64185753495, 10262.076413122557, 6155.784547540815, 7633.770986870402, 7694.923050769645, 7768.572728499987, 7771.72798952034, 8156.143604921398, 8246.83506329882, 8287.046989596274, 8301.916980830356, 8337.624806883583, 7283.308085731847, 7465.0, 7471.8879216812875, 7485.700571977278, 7551.0, 7364.153122390993, 7423.406127509678, 7434.665440055319, 7505.399568034653, 7523.435742319458, 7873.212678732081, 7907.48601340911, 7939.642716077675, 7986.041674999037, 7999.120096789465, 7127.572345659277, 7167.964160179165, 7182.820429489305, 7234.276572342724, 7277.745278915424, 7194.532355396883, 7217.170025447141, 7251.20236773965, 7258.274172582699, 7266.7093316266755], "unit": "score", "name": "mootools.html", "value": 5094.192897255153}, {"lowerIsBetter": false, "replicates": [332.9483929990852, 334.33634236041456, 338.8627605819644, 342.64707351428035, 343.70098014727176, 6330.6834658267135, 6750.898736518956, 6752.763653272136, 6778.423833974112, 6804.795856124318, 6697.0, 6751.156105486814, 6775.1531058617675, 6780.254172041072, 6790.762323318685, 4759.190937540609, 4858.740685581221, 4939.876503087416, 4963.354763880709, 5005.474425185367, 3964.7224694271267, 4019.4171845082446, 4931.334269873557, 4939.086269040221, 5071.137906555894, 4945.975270123644, 4958.256261560777, 4971.577415919651, 4979.456368525751, 4982.9252561211615, 4368.934465983013, 4642.396488456496, 4974.77613507393, 4983.127952608279, 4986.700797952134, 4263.0, 4276.422682937795, 4277.315629499265, 4280.464941882265, 4288.142371525676, 6361.332060133712, 6530.93469065308, 6630.469562434993, 6638.73445062197, 6643.40209381158, 5914.4676979071655, 5975.910361344583, 5984.431479009487, 6005.159277701126, 6005.789797357115, 5459.372172200208, 5863.560232982501, 7242.0223269858425, 7268.636568171623, 7305.926940730631, 4803.975980120112, 4810.254410566367, 4810.879728006793, 4828.179209534387, 4834.830780922651, 7688.6924523019015, 7734.922650773477, 7749.380049596019, 7787.0, 7816.72641457552, 4710.929336059962, 4837.975810120997, 4859.659823812299, 4871.3667223261455, 4925.285833554186, 3626.7279954003557, 4162.604552567501, 4932.136876046678, 4934.210526315772, 4983.651144419929, 5766.385412084623, 5837.328707198726, 5933.199018132583, 5967.224260846062, 5980.73086711099, 6452.7094581083975, 6760.425363844129, 7327.487075904635, 7340.0, 7345.265473452612, 1711.79458464985, 1725.852308215048, 1726.9395571154948, 1727.06738361286, 1728.3086765293983, 1008.1682611845257, 1087.7280679830042, 1125.836753670713, 1133.8072527670315, 1152.8962393384468, 5153.6907785532985, 5528.391876893538, 6812.046313516112, 6836.965815170893, 6911.619860907698, 7571.507851989603, 7578.3179513842915, 7588.165301816795, 7594.088709354803, 7601.049868766404, 6655.367740064686, 6712.597244165268, 6948.895766563404, 6955.965220173968, 6976.93023069773, 3536.9469457958153, 3722.9203530976256, 4044.676425885922, 4045.0494133878515, 4048.0, 7288.890666640004, 7954.960225198837, 8026.678932842621, 8039.236272554098, 8044.195580442026, 6752.291009444036, 7496.887546686804, 7566.546007239584, 7923.603819808986, 7941.245581669732, 7905.130435652074, 8051.758447246475, 8056.919430805617, 8057.274845263954, 8063.556504392314, 7576.545407275581, 7621.961890190735, 7622.199669034671, 7646.923530764621, 7675.808104797425, 5961.731722072431, 7476.70093196266, 7478.70085196586, 7490.213527579525, 7500.737474188377, 7721.575313357819, 8019.599020048858, 8031.718889838828, 8055.798605034921, 8119.918800811916, 3875.8837234883, 4716.528347165256, 4753.572178503951, 4754.762261886961, 4774.737389443614, 7650.579218142833, 7661.659209638179, 7662.540247585162, 7680.039995000625, 7695.57674327895, 6718.764843230463, 6803.353681400259, 7399.334059934632, 7404.222556631692, 7442.7395041173295, 6309.148264984168, 7170.820729481805, 7399.297066778648, 7404.518706284074, 7408.03695519579, 7193.640317983975, 7208.098987626547, 7221.350078492961, 7254.383377412979, 7266.0, 7339.926600733925, 7345.228750981284, 7350.375218106521, 7359.374453171326, 7370.0, 7226.530275532074, 7233.782986510413, 7238.565686058853, 7246.74636387745, 7256.89114663291], "unit": "score", "name": "prototype.html", "value": 5284.64645514583}, {"lowerIsBetter": false, "replicates": [653.8561516466378, 714.6641078693015, 716.3874886971639, 740.7777666699989, 785.1559573458532, 15038.398464061438, 15173.544793656209, 15332.15673137977, 15475.84524154758, 15487.612809679764, 14178.078424902375, 14192.36134373953, 14197.78703319451, 14233.074850134733, 14273.286335683226, 757.6742000939594, 955.4028732042474, 985.8373368394207, 989.7080361293399, 992.4045572656421, 968.6803354892903, 971.4317124482186, 981.2640519610293, 984.4733067808723, 990.9702708918744, 1019.7660830395193, 1044.8589440425521, 1048.3395460859647, 1049.2445439283742, 1050.6217761605815, 1002.8495725641139, 1006.7684432580547, 1010.5048526222135, 1013.7769690668041, 1018.5874720738038, 748.4573684079054, 762.8207371267748, 767.7197822794695, 775.9806004849924, 783.4006984656742, 14845.109293442429, 14958.027728197632, 15002.24988750558, 15006.849931500763, 15011.624709382244, 10435.530401131968, 12836.294003829786, 12913.225206487641, 12943.158694684815, 13006.739865202642, 8510.787230319229, 9935.503224838729, 10008.699739007841, 10233.283670143093, 10308.690739277834, 3568.1614820517157, 3569.678728914384, 3618.0412190769202, 3651.2879988402274, 3801.4297855321925, 84080.57959710162, 84459.15540844575, 86762.0, 86906.13093869107, 87114.0, 8616.48301101936, 8803.735887923373, 9700.320977531504, 9730.464824434583, 9889.950550247346, 21836.45408864791, 22418.327450176195, 22518.887405562866, 22650.0, 22818.201362952215, 7437.144728356308, 7467.327940485274, 7504.549727016287, 7566.772996810105, 7647.120581133129, 4099.959000410017, 4206.0, 4217.599328063829, 4218.346156345771, 4224.619784219373, 3753.9436908446396, 3791.5071040764524, 3804.2962052020466, 3807.485989391452, 3811.8475260989803, 661.9900701489481, 662.4766434516678, 667.442685357722, 678.4809620640215, 696.5368030259922, 567.5771550195132, 580.7183515994739, 604.7218279591349, 609.6342194683155, 610.9908351374733, 7850.607469626496, 8194.057683366489, 8249.175082491824, 8307.6676932922, 8414.579271036424, 532.2309263114762, 582.2547139661241, 597.2951916738203, 600.4565867889567, 617.5491890919564, 3374.865005399806, 3653.94519082214, 3657.4330978698345, 3868.709846761448, 3879.670228030649, 95907.52046239724, 96168.0, 96766.0, 97277.51361243149, 97306.0, 76355.23644763482, 77181.22818771741, 80376.0, 82135.91748045608, 82533.58733206296, 68766.0, 69158.30841691619, 71277.6436117816, 72249.6387518059, 74942.12644683926, 7496.662650180864, 7639.312461878235, 7724.459287850022, 7799.922000780147, 7965.960170199112, 46330.536694632625, 46396.0, 48057.519424806706, 49174.50825491699, 50861.0, 60329.69835150796, 68918.0, 70562.64718676374, 71163.57672846617, 72148.0, 10329.173666106844, 10335.896641033794, 10474.738131546468, 10607.469626518798, 10676.0, 10718.0, 10730.980556847087, 10743.194260430342, 11043.723906902393, 11262.662120136409, 10144.340617859816, 10176.592936282466, 10183.541740621542, 10187.949060254949, 10918.962698543626, 9620.182284505896, 9663.13031827139, 9775.853362199716, 9805.803883922139, 9807.0, 9820.263480239153, 9895.802083958137, 9905.900940990787, 10033.14718248957, 10650.946745266534, 7761.650725717469, 8124.593770311342, 8205.671773129247, 8267.793305167179, 8787.25308348772, 8465.407421480684, 8485.448445851, 8613.138686131588, 8773.824523509622, 8959.41763785352], "unit": "score", "name": "yui.html", "value": 6874.040654163763}], "name": "dromaeo_css", "value": 7719.144013147134}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [129.0, 95.0, 138.0, 172.0, 174.0, 127.0, 112.0, 93.0, 170.0, 104.0], "unit": "score", "name": "ai-astar", "value": 131.4}, {"lowerIsBetter": true, "replicates": [154.0, 120.0, 179.0, 168.0, 120.0, 143.0, 121.0, 152.0, 149.0, 119.0], "unit": "score", "name": "audio-beat-detection", "value": 142.5}, {"lowerIsBetter": true, "replicates": [191.0, 199.0, 196.0, 200.0, 197.0, 195.0, 195.0, 197.0, 196.0, 197.0], "unit": "score", "name": "audio-dft", "value": 196.3}, {"lowerIsBetter": true, "replicates": [70.0, 70.0, 92.0, 149.0, 84.0, 74.0, 57.0, 58.0, 117.0, 60.0], "unit": "score", "name": "audio-fft", "value": 83.1}, {"lowerIsBetter": true, "replicates": [86.0, 116.0, 143.0, 81.0, 80.0, 82.0, 120.0, 80.0, 81.0, 120.0], "unit": "score", "name": "audio-oscillator", "value": 98.9}, {"lowerIsBetter": true, "replicates": [89.0, 87.0, 90.0, 88.0, 99.0, 132.0, 77.0, 132.0, 135.0, 129.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 105.8}, {"lowerIsBetter": true, "replicates": [94.0, 95.0, 95.0, 95.0, 94.0, 94.0, 94.0, 95.0, 93.0, 95.0], "unit": "score", "name": "imaging-darkroom", "value": 94.4}, {"lowerIsBetter": true, "replicates": [139.0, 153.0, 89.0, 100.0, 129.0, 94.0, 119.0, 148.0, 92.0, 91.0], "unit": "score", "name": "imaging-desaturate", "value": 115.4}, {"lowerIsBetter": true, "replicates": [53.0, 59.0, 58.0, 60.0, 53.0, 56.0, 55.0, 74.0, 72.0, 86.0], "unit": "score", "name": "json-parse-financial", "value": 62.6}, {"lowerIsBetter": true, "replicates": [62.0, 65.0, 70.0, 67.0, 68.0, 73.0, 70.0, 67.0, 77.0, 101.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 72.0}, {"lowerIsBetter": true, "replicates": [82.0, 85.0, 84.0, 83.0, 84.0, 81.0, 83.0, 84.0, 84.0, 87.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.7}, {"lowerIsBetter": true, "replicates": [124.0, 133.0, 116.0, 130.0, 135.0, 151.0, 138.0, 119.0, 120.0, 128.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 129.4}, {"lowerIsBetter": true, "replicates": [125.0, 134.0, 139.0, 135.0, 134.0, 126.0, 139.0, 134.0, 138.0, 133.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 133.7}, {"lowerIsBetter": true, "replicates": [67.0, 69.0, 65.0, 67.0, 65.0, 64.0, 66.0, 67.0, 65.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.3}], "name": "kraken", "value": 1515.5}]} 04:51:27 INFO - Return code: 0 04:51:27 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 04:51:27 ERROR - # TBPL SUCCESS # 04:51:27 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 04:51:27 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 04:51:27 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 04:51:27 INFO - 2016-04-08 04:51:27.246 screenresolution[1962:18188] starting screenresolution argv=screenresolution get 04:51:27 INFO - 2016-04-08 04:51:27.249 screenresolution[1962:18188] Display 0: 1600x1200x32@60 04:51:27 INFO - 2016-04-08 04:51:27.255 screenresolution[1963:18191] starting screenresolution argv=screenresolution list 04:51:27 INFO - Available Modes on Display 0 04:51:27 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 04:51:27 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 04:51:27 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 04:51:27 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 04:51:27 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 04:51:27 INFO - Intel Iris: 04:51:27 INFO - Chipset Model: Intel Iris 04:51:27 INFO - Type: GPU 04:51:27 INFO - Bus: Built-In 04:51:27 INFO - VRAM (Dynamic, Max): 1536 MB 04:51:27 INFO - Vendor: Intel (0x8086) 04:51:27 INFO - Device ID: 0x0a2e 04:51:27 INFO - Revision ID: 0x0009 04:51:27 INFO - Displays: 04:51:27 INFO - Display: 04:51:27 INFO - Resolution: 1600 x 1200 @ 60 Hz 04:51:27 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 04:51:27 INFO - Display Serial Number: 1600x1200 60 04:51:27 INFO - Main Display: Yes 04:51:27 INFO - Mirror: Off 04:51:27 INFO - Online: Yes 04:51:27 INFO - Rotation: Supported 04:51:27 INFO - Return code: 0 04:51:27 INFO - Running post-action listener: _resource_record_post_action 04:51:27 INFO - Running post-run listener: _resource_record_post_run 04:51:28 INFO - Total resource usage - Wall time: 1203s; CPU: 53.0%; Read bytes: 1228800; Write bytes: 669364224; Read time: 10; Write time: 2054 04:51:28 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 354028032; Write bytes: 355117056; Read time: 28514; Write time: 751 04:51:28 INFO - run-tests - Wall time: 1170s; CPU: 53.0%; Read bytes: 1228800; Write bytes: 302649344; Read time: 10; Write time: 1265 04:51:28 INFO - Running post-run listener: _upload_blobber_files 04:51:28 INFO - Blob upload gear active. 04:51:28 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:51:28 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:51:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:51:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:51:29 INFO - (blobuploader) - INFO - Open directory for files ... 04:51:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:51:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:51:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:51:30 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:51:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:51:30 INFO - (blobuploader) - INFO - Done attempting. 04:51:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:51:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:51:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:51:32 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:51:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:51:32 INFO - (blobuploader) - INFO - Done attempting. 04:51:32 INFO - (blobuploader) - INFO - Iteration through files over. 04:51:32 INFO - Return code: 0 04:51:32 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:51:32 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:51:32 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a9a737baf0633328a0abe8ebf0c59bb0198f62ba69e5ad4ee820d0c9e99ae3ae51bc650e5f19d38bc4edbad7dd50370383d51a399b38544c6c2d18b75c995fc6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/447ad7884aa90267e1384afe5841733a2f9c281413fa330aeecf2c0fa19001ed773b21104caa73e1abb86ff3e5f8d9ca9b571506a9cc9c7dbc69925321c90475"} 04:51:32 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:51:32 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:51:32 INFO - Contents: 04:51:32 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a9a737baf0633328a0abe8ebf0c59bb0198f62ba69e5ad4ee820d0c9e99ae3ae51bc650e5f19d38bc4edbad7dd50370383d51a399b38544c6c2d18b75c995fc6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/447ad7884aa90267e1384afe5841733a2f9c281413fa330aeecf2c0fa19001ed773b21104caa73e1abb86ff3e5f8d9ca9b571506a9cc9c7dbc69925321c90475"} 04:51:32 INFO - Running post-run listener: copy_logs_to_upload_dir 04:51:32 INFO - Copying logs to upload dir... 04:51:32 INFO - mkdir: /builds/slave/test/build/upload/logs 04:51:32 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1324.546988 ========= master_lag: 0.07 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 4 secs) (at 2016-04-08 04:51:32.690151) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-08 04:51:32.693295) ========= 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.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a9a737baf0633328a0abe8ebf0c59bb0198f62ba69e5ad4ee820d0c9e99ae3ae51bc650e5f19d38bc4edbad7dd50370383d51a399b38544c6c2d18b75c995fc6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/447ad7884aa90267e1384afe5841733a2f9c281413fa330aeecf2c0fa19001ed773b21104caa73e1abb86ff3e5f8d9ca9b571506a9cc9c7dbc69925321c90475"} build_url:https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010810 build_url: 'https://queue.taskcluster.net/v1/task/SfsssTHfS0Wb-e4qMY16Aw/artifacts/public/build/firefox-47.0a2.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a9a737baf0633328a0abe8ebf0c59bb0198f62ba69e5ad4ee820d0c9e99ae3ae51bc650e5f19d38bc4edbad7dd50370383d51a399b38544c6c2d18b75c995fc6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/447ad7884aa90267e1384afe5841733a2f9c281413fa330aeecf2c0fa19001ed773b21104caa73e1abb86ff3e5f8d9ca9b571506a9cc9c7dbc69925321c90475"}' ========= master_lag: 0.07 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-08 04:51:32.776831) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-08 04:51:32.777169) ========= 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.IohbLoszpP/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.J9dkZbBjBj/Listeners TMPDIR=/var/folders/6x/fp43dmc567bb9pghsl0yp6g400000w/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.005148 ========= master_lag: 0.15 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-08 04:51:32.933297) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-08 04:51:32.933602) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-08 04:51:32.934018) ========= ========= Total master_lag: 0.50 =========