builder: mozilla-central_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0144 starttime: 1457700433.69 results: success (0) buildid: 20160311025214 builduid: 6ba81d9c8ecd463fa90e7c035ee9fc33 revision: 102886e9ac63b3fa33a6f1b394aea054abce2dfd ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.692366) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.692785) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.693072) ========= 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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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.005543 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.717182) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.717482) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.734674) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.734946) ========= 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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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.005178 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.782560) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.782846) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.783216) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.783497) ========= 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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-03-11 04:47:13-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 15.0M=0.001s 2016-03-11 04:47:13 (15.0 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.167683 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.967117) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:13.967429) ========= 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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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.025869 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:14.016150) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-11 04:47:14.016472) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 102886e9ac63b3fa33a6f1b394aea054abce2dfd --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 102886e9ac63b3fa33a6f1b394aea054abce2dfd --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-03-11 04:47:14,054 truncating revision to first 12 chars 2016-03-11 04:47:14,054 Setting DEBUG logging. 2016-03-11 04:47:14,054 attempt 1/10 2016-03-11 04:47:14,054 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/102886e9ac63?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-11 04:47:15,018 unpacking tar archive at: mozilla-central-102886e9ac63/testing/mozharness/ program finished with exit code 0 elapsedTime=1.206346 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-11 04:47:15.237884) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:15.238252) ========= echo 102886e9ac63b3fa33a6f1b394aea054abce2dfd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'102886e9ac63b3fa33a6f1b394aea054abce2dfd'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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 102886e9ac63b3fa33a6f1b394aea054abce2dfd program finished with exit code 0 elapsedTime=0.004863 script_repo_revision: '102886e9ac63b3fa33a6f1b394aea054abce2dfd' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:15.287468) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:15.287790) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-11 04:47:15.300299) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 10 secs) (at 2016-03-11 04:47:15.300651) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:15 INFO - MultiFileLogger online at 20160311 04:47:15 in /builds/slave/test 04:47:15 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 04:47:15 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:47:15 INFO - {'append_to_log': False, 04:47:15 INFO - 'base_work_dir': '/builds/slave/test', 04:47:15 INFO - 'blob_upload_branch': 'Firefox', 04:47:15 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:47:15 INFO - 'branch': 'Firefox', 04:47:15 INFO - 'buildbot_json_path': 'buildprops.json', 04:47:15 INFO - 'config_files': ('talos/mac_config.py',), 04:47:15 INFO - 'default_actions': ('clobber', 04:47:15 INFO - 'read-buildbot-config', 04:47:15 INFO - 'download-and-extract', 04:47:15 INFO - 'populate-webroot', 04:47:15 INFO - 'create-virtualenv', 04:47:15 INFO - 'install', 04:47:15 INFO - 'run-tests'), 04:47:15 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:47:15 INFO - 'download_minidump_stackwalk': True, 04:47:15 INFO - 'download_symbols': 'ondemand', 04:47:15 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:47:15 INFO - 'tooltool.py': '/tools/tooltool.py', 04:47:15 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:47:15 INFO - '/tools/misc-python/virtualenv.py')}, 04:47:15 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:47:15 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:47:15 INFO - 'installer_path': 'installer.exe', 04:47:15 INFO - 'log_level': 'info', 04:47:15 INFO - 'log_name': 'talos', 04:47:15 INFO - 'log_to_console': True, 04:47:15 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 04:47:15 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 04:47:15 INFO - 'opt_config_files': (), 04:47:15 INFO - 'pip_index': False, 04:47:15 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 04:47:15 INFO - 'cmd': ('bash', 04:47:15 INFO - '-c', 04:47:15 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 04:47:15 INFO - 'enabled': True, 04:47:15 INFO - 'halt_on_failure': False, 04:47:15 INFO - 'name': 'check_screen_resolution'},), 04:47:15 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 04:47:15 INFO - 'cmd': ('bash', 04:47:15 INFO - '-c', 04:47:15 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 04:47:15 INFO - 'enabled': True, 04:47:15 INFO - 'halt_on_failure': False, 04:47:15 INFO - 'name': 'check_screen_resolution'},), 04:47:15 INFO - 'run_cmd_checks_enabled': True, 04:47:15 INFO - 'sps_profile': False, 04:47:15 INFO - 'sps_profile_interval': 0, 04:47:15 INFO - 'suite': 'dromaeojs', 04:47:15 INFO - 'system_bits': '32', 04:47:15 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:47:15 INFO - 'title': 't-yosemite-r7-0144', 04:47:15 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:47:15 INFO - 'use_talos_json': True, 04:47:15 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:47:15 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:47:15 INFO - 'work_dir': 'build'} 04:47:15 INFO - ##### 04:47:15 INFO - ##### Running clobber step. 04:47:15 INFO - ##### 04:47:15 INFO - Running pre-action listener: _resource_record_pre_action 04:47:15 INFO - Running main action method: clobber 04:47:15 INFO - rmtree: /builds/slave/test/build 04:47:15 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:47:17 INFO - Running post-action listener: _resource_record_post_action 04:47:17 INFO - ##### 04:47:17 INFO - ##### Running read-buildbot-config step. 04:47:17 INFO - ##### 04:47:17 INFO - Running pre-action listener: _resource_record_pre_action 04:47:17 INFO - Running main action method: read_buildbot_config 04:47:17 INFO - Using buildbot properties: 04:47:17 INFO - { 04:47:17 INFO - "project": "", 04:47:17 INFO - "product": "firefox", 04:47:17 INFO - "script_repo_revision": "production", 04:47:17 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs", 04:47:17 INFO - "repository": "", 04:47:17 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs", 04:47:17 INFO - "buildid": "20160311025214", 04:47:17 INFO - "pgo_build": "False", 04:47:17 INFO - "basedir": "/builds/slave/test", 04:47:17 INFO - "buildnumber": 163, 04:47:17 INFO - "slavename": "t-yosemite-r7-0144", 04:47:17 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 04:47:17 INFO - "platform": "yosemite_r7", 04:47:17 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 04:47:17 INFO - "branch": "mozilla-central", 04:47:17 INFO - "repo_path": "mozilla-central", 04:47:17 INFO - "revision": "102886e9ac63b3fa33a6f1b394aea054abce2dfd", 04:47:17 INFO - "stage_platform": "macosx64", 04:47:17 INFO - "builduid": "6ba81d9c8ecd463fa90e7c035ee9fc33", 04:47:17 INFO - "slavebuilddir": "test" 04:47:17 INFO - } 04:47:17 INFO - Found installer url https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg. 04:47:17 INFO - Running post-action listener: _resource_record_post_action 04:47:17 INFO - ##### 04:47:17 INFO - ##### Running download-and-extract step. 04:47:17 INFO - ##### 04:47:17 INFO - Running pre-action listener: _resource_record_pre_action 04:47:17 INFO - Running main action method: download_and_extract 04:47:17 INFO - mkdir: /builds/slave/test/build/tests 04:47:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:17 INFO - https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 04:47:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 04:47:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 04:47:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 04:47:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json'}, attempt #1 04:47:19 INFO - Downloaded 1199 bytes. 04:47:19 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 04:47:19 INFO - Using the following test package requirements: 04:47:19 INFO - {u'common': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 04:47:19 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:47:19 INFO - u'firefox-48.0a1.en-US.mac.cppunittest.tests.zip'], 04:47:19 INFO - u'gtest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:47:19 INFO - u'firefox-48.0a1.en-US.mac.gtest.tests.zip'], 04:47:19 INFO - u'jittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:47:19 INFO - u'jsshell-mac.zip'], 04:47:19 INFO - u'mochitest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:47:19 INFO - u'firefox-48.0a1.en-US.mac.mochitest.tests.zip'], 04:47:19 INFO - u'mozbase': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 04:47:19 INFO - u'reftest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:47:19 INFO - u'firefox-48.0a1.en-US.mac.reftest.tests.zip'], 04:47:19 INFO - u'talos': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:47:19 INFO - u'firefox-48.0a1.en-US.mac.talos.tests.zip'], 04:47:19 INFO - u'web-platform': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:47:19 INFO - u'firefox-48.0a1.en-US.mac.web-platform.tests.zip'], 04:47:19 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 04:47:19 INFO - u'firefox-48.0a1.en-US.mac.xpcshell.tests.zip']} 04:47:19 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip'] for test suite category: common 04:47: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:47:19 INFO - https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 04:47:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:47:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:47:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:47:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 04:47:20 INFO - Downloaded 17867475 bytes. 04:47:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:47:20 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 04:47:23 INFO - Return code: 0 04:47:23 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip', u'firefox-48.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 04:47:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:23 INFO - https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 04:47:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:47:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:47:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 04:47:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 04:47:24 INFO - Downloaded 17867475 bytes. 04:47:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:47:24 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 04:47:27 INFO - Return code: 0 04:47:27 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:47:27 INFO - https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 04:47:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 04:47:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 04:47:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip 04:47:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip'}, attempt #1 04:47:28 INFO - Downloaded 10845161 bytes. 04:47:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:47:28 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 04:47:29 INFO - Return code: 0 04:47: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:47:29 INFO - https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 04:47:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 04:47:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 04:47:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg 04:47:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg'}, attempt #1 04:47:32 INFO - Downloaded 111027970 bytes. 04:47:32 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 04:47:32 INFO - mkdir: /builds/slave/test/properties 04:47:32 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:47:32 INFO - Writing to file /builds/slave/test/properties/build_url 04:47:32 INFO - Contents: 04:47:32 INFO - build_url:https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 04:47:33 INFO - Running post-action listener: _resource_record_post_action 04:47:33 INFO - Running post-action listener: set_extra_try_arguments 04:47:33 INFO - ##### 04:47:33 INFO - ##### Running populate-webroot step. 04:47:33 INFO - ##### 04:47:33 INFO - Running pre-action listener: _resource_record_pre_action 04:47:33 INFO - Running main action method: populate_webroot 04:47:33 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:47:33 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:47:33 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:47:33 INFO - '--tppagecycles', 04:47:33 INFO - '7'], 04:47:33 INFO - 'tests': ['tsvgm']}}, 04:47:33 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:47:33 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:47:33 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 04:47:33 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:47:33 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:47:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:47:33 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:47:33 INFO - 'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:47:33 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:47:33 INFO - 'tests': ['damp', 'tps']}, 04:47:33 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:47:33 INFO - 'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['damp', 'tps']}, 04:47:33 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:47:33 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:47:33 INFO - 'other': {'tests': ['a11yr', 04:47:33 INFO - 'ts_paint', 04:47:33 INFO - 'tpaint', 04:47:33 INFO - 'sessionrestore', 04:47:33 INFO - 'sessionrestore_no_auto_restore', 04:47:33 INFO - 'tabpaint']}, 04:47:33 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['a11yr', 04:47:33 INFO - 'ts_paint', 04:47:33 INFO - 'tpaint', 04:47:33 INFO - 'sessionrestore', 04:47:33 INFO - 'sessionrestore_no_auto_restore', 04:47:33 INFO - 'tabpaint']}, 04:47:33 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['a11yr', 04:47:33 INFO - 'ts_paint', 04:47:33 INFO - 'tpaint', 04:47:33 INFO - 'sessionrestore', 04:47:33 INFO - 'sessionrestore_no_auto_restore', 04:47:33 INFO - 'tabpaint']}, 04:47:33 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['a11yr', 04:47:33 INFO - 'ts_paint', 04:47:33 INFO - 'tpaint', 04:47:33 INFO - 'sessionrestore', 04:47:33 INFO - 'sessionrestore_no_auto_restore', 04:47:33 INFO - 'tabpaint']}, 04:47:33 INFO - 'other_l64': {'tests': ['a11yr', 04:47:33 INFO - 'ts_paint', 04:47:33 INFO - 'tpaint', 04:47:33 INFO - 'sessionrestore', 04:47:33 INFO - 'sessionrestore_no_auto_restore', 04:47:33 INFO - 'tabpaint']}, 04:47:33 INFO - 'other_nol64': {'tests': ['a11yr', 04:47:33 INFO - 'ts_paint', 04:47:33 INFO - 'tpaint', 04:47:33 INFO - 'sessionrestore', 04:47:33 INFO - 'sessionrestore_no_auto_restore', 04:47:33 INFO - 'tabpaint']}, 04:47:33 INFO - 'svgr': {'tests': ['tsvgx', 04:47:33 INFO - 'tsvgr_opacity', 04:47:33 INFO - 'tart', 04:47:33 INFO - 'tscrollx', 04:47:33 INFO - 'cart']}, 04:47:33 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['tsvgx', 04:47:33 INFO - 'tsvgr_opacity', 04:47:33 INFO - 'tart', 04:47:33 INFO - 'tscrollx', 04:47:33 INFO - 'cart']}, 04:47:33 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:47:33 INFO - 'tests': ['tp5o']}, 04:47:33 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:47:33 INFO - 'talos_options': ['--e10s'], 04:47:33 INFO - 'tests': ['tp5o']}, 04:47:33 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:47:33 INFO - 'talos_options': ['--xperf_path', 04:47:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:47:33 INFO - 'tests': ['tp5n']}, 04:47:33 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:47:33 INFO - 'talos_options': ['--e10s', 04:47:33 INFO - '--xperf_path', 04:47:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:47:33 INFO - 'tests': ['tp5n']}}, 04:47:33 INFO - 'talos.zip': {'path': '', 04:47:33 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:47:33 INFO - Running post-action listener: _resource_record_post_action 04:47:33 INFO - ##### 04:47:33 INFO - ##### Running create-virtualenv step. 04:47:33 INFO - ##### 04:47:33 INFO - Running pre-action listener: _resource_record_pre_action 04:47:33 INFO - Running main action method: create_virtualenv 04:47:33 INFO - Creating virtualenv /builds/slave/test/build/venv 04:47:33 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:47:33 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:47:33 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:47:33 INFO - Using real prefix '/tools/python27' 04:47:33 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:47:34 INFO - Installing distribute.............................................................................................................................................................................................done. 04:47:37 INFO - Installing pip.................done. 04:47:37 INFO - Return code: 0 04:47:37 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:47:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:47:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:47:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:37 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 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:37 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:47:37 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:47:37 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:47:37 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:47:37 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:47:37 INFO - 'HOME': '/Users/cltbld', 04:47:37 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:47:37 INFO - 'LOGNAME': 'cltbld', 04:47:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:47:37 INFO - 'MOZ_NO_REMOTE': '1', 04:47:37 INFO - 'NO_EM_RESTART': '1', 04:47:37 INFO - 'PAGER': '/bin/cat', 04:47:37 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:47:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:47:37 INFO - 'PWD': '/builds/slave/test', 04:47:37 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:47:37 INFO - 'SHELL': '/bin/bash', 04:47:37 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:47:37 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:47:37 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:47:37 INFO - 'USER': 'cltbld', 04:47:37 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:47:37 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:47:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:47:37 INFO - 'XPC_FLAGS': '0x0', 04:47:37 INFO - 'XPC_SERVICE_NAME': '0', 04:47:37 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:47:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:47:37 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:47:37 INFO - Cleaning up... 04:47:37 INFO - Return code: 0 04:47:37 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:47:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:47:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:47:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:37 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 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:37 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:47:37 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:47:37 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:47:37 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:47:37 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:47:37 INFO - 'HOME': '/Users/cltbld', 04:47:37 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:47:37 INFO - 'LOGNAME': 'cltbld', 04:47:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:47:37 INFO - 'MOZ_NO_REMOTE': '1', 04:47:37 INFO - 'NO_EM_RESTART': '1', 04:47:37 INFO - 'PAGER': '/bin/cat', 04:47:37 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:47:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:47:37 INFO - 'PWD': '/builds/slave/test', 04:47:37 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:47:37 INFO - 'SHELL': '/bin/bash', 04:47:37 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:47:37 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:47:37 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:47:37 INFO - 'USER': 'cltbld', 04:47:37 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:47:37 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:47:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:47:37 INFO - 'XPC_FLAGS': '0x0', 04:47:37 INFO - 'XPC_SERVICE_NAME': '0', 04:47:37 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:47:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:47:37 INFO - Downloading/unpacking psutil>=0.7.1 04:47:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:47:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:47:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:47:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:47:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:47:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:47:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:47:40 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:47:40 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:47:40 INFO - Installing collected packages: psutil 04:47:40 INFO - Running setup.py install for psutil 04:47:40 INFO - building 'psutil._psutil_osx' extension 04:47:40 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:47:41 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:47:41 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:47:41 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:47:41 INFO - building 'psutil._psutil_posix' extension 04:47:41 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:47:41 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 04:47:41 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 04:47:41 INFO - ^ 04:47:41 INFO - 1 warning generated. 04:47:41 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:47:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:47:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:47:41 INFO - Successfully installed psutil 04:47:41 INFO - Cleaning up... 04:47:41 INFO - Return code: 0 04:47:41 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:47:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:47:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:47:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:41 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 04:47:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 04:47:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:47:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:47:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:47:41 INFO - 'HOME': '/Users/cltbld', 04:47:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:47:41 INFO - 'LOGNAME': 'cltbld', 04:47:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:47:41 INFO - 'MOZ_NO_REMOTE': '1', 04:47:41 INFO - 'NO_EM_RESTART': '1', 04:47:41 INFO - 'PAGER': '/bin/cat', 04:47:41 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:47:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:47:41 INFO - 'PWD': '/builds/slave/test', 04:47:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:47:41 INFO - 'SHELL': '/bin/bash', 04:47:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:47:41 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:47:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:47:41 INFO - 'USER': 'cltbld', 04:47:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:47:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:47:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:47:41 INFO - 'XPC_FLAGS': '0x0', 04:47:41 INFO - 'XPC_SERVICE_NAME': '0', 04:47:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:47:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:47:42 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:47:42 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:47:42 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:47:42 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:47:42 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:47:42 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:47:42 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:47:44 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:47:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:47:44 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:47:44 INFO - Installing collected packages: mozsystemmonitor 04:47:44 INFO - Running setup.py install for mozsystemmonitor 04:47:44 INFO - Successfully installed mozsystemmonitor 04:47:44 INFO - Cleaning up... 04:47:44 INFO - Return code: 0 04:47:44 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:47:44 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:47:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:47:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:44 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:47:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:47:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:44 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 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:44 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:47:44 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:47:44 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:47:44 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:47:44 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:47:44 INFO - 'HOME': '/Users/cltbld', 04:47:44 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:47:44 INFO - 'LOGNAME': 'cltbld', 04:47:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:47:44 INFO - 'MOZ_NO_REMOTE': '1', 04:47:44 INFO - 'NO_EM_RESTART': '1', 04:47:44 INFO - 'PAGER': '/bin/cat', 04:47:44 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:47:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:47:44 INFO - 'PWD': '/builds/slave/test', 04:47:44 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:47:44 INFO - 'SHELL': '/bin/bash', 04:47:44 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:47:44 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:47:44 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:47:44 INFO - 'USER': 'cltbld', 04:47:44 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:47:44 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:47:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:47:44 INFO - 'XPC_FLAGS': '0x0', 04:47:44 INFO - 'XPC_SERVICE_NAME': '0', 04:47:44 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:47:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:47:44 INFO - Downloading/unpacking blobuploader==1.2.4 04:47:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:47:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:47:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:47:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:47:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:47:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:47:47 INFO - Downloading blobuploader-1.2.4.tar.gz 04:47:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:47:47 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:47:47 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:47:47 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:47:47 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:47:47 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:47:47 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:47:47 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:47:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:47:47 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:47:47 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:47:47 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:47:47 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:47:47 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:47:47 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:47:47 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:47:48 INFO - Downloading docopt-0.6.1.tar.gz 04:47:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:47:48 INFO - Installing collected packages: blobuploader, requests, docopt 04:47:48 INFO - Running setup.py install for blobuploader 04:47:48 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:47:48 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:47:48 INFO - Running setup.py install for requests 04:47:49 INFO - Running setup.py install for docopt 04:47:49 INFO - Successfully installed blobuploader requests docopt 04:47:49 INFO - Cleaning up... 04:47:49 INFO - Return code: 0 04:47:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:47:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:47:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:47:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:47:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:47:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:49 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 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:49 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:47:49 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:47:49 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:47:49 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:47:49 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:47:49 INFO - 'HOME': '/Users/cltbld', 04:47:49 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:47:49 INFO - 'LOGNAME': 'cltbld', 04:47:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:47:49 INFO - 'MOZ_NO_REMOTE': '1', 04:47:49 INFO - 'NO_EM_RESTART': '1', 04:47:49 INFO - 'PAGER': '/bin/cat', 04:47:49 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:47:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:47:49 INFO - 'PWD': '/builds/slave/test', 04:47:49 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:47:49 INFO - 'SHELL': '/bin/bash', 04:47:49 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:47:49 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:47:49 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:47:49 INFO - 'USER': 'cltbld', 04:47:49 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:47:49 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:47:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:47:49 INFO - 'XPC_FLAGS': '0x0', 04:47:49 INFO - 'XPC_SERVICE_NAME': '0', 04:47:49 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:47:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:47:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:47:49 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-cuQq83-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:47:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:47:49 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-cuwgfv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:47:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:47:49 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-NqtitZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:47:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:47:49 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-SvEj7F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-WDVUWm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-lFYTSo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-yi7plO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-0IoH1Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-w1S8Qz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-WzQAEG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-gQUeN9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-fuHQxI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-RtbG_m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:47:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:47:50 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-S_jY4j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:47:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:47:51 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-cvR7nx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:47:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:47:51 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-FlpwEh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:47:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:47:51 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-E8e2Ax-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:47:51 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:47:51 INFO - Running setup.py install for manifestparser 04:47:51 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:47:51 INFO - Running setup.py install for mozcrash 04:47:51 INFO - Running setup.py install for mozdebug 04:47:51 INFO - Running setup.py install for mozdevice 04:47:51 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:47:51 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:47:51 INFO - Running setup.py install for mozfile 04:47:52 INFO - Running setup.py install for mozhttpd 04:47:52 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:47:52 INFO - Running setup.py install for mozinfo 04:47:52 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:47:52 INFO - Running setup.py install for mozInstall 04:47:52 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:47:52 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:47:52 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:47:52 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:47:52 INFO - Running setup.py install for mozleak 04:47:52 INFO - Running setup.py install for mozlog 04:47:52 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:47:52 INFO - Running setup.py install for moznetwork 04:47:52 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:47:52 INFO - Running setup.py install for mozprocess 04:47:53 INFO - Running setup.py install for mozprofile 04:47:53 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:47:53 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:47:53 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:47:53 INFO - Running setup.py install for mozrunner 04:47:53 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:47:53 INFO - Running setup.py install for mozscreenshot 04:47:53 INFO - Running setup.py install for moztest 04:47:53 INFO - Running setup.py install for mozversion 04:47:53 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:47:53 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:47:53 INFO - Cleaning up... 04:47:53 INFO - Return code: 0 04:47:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:47: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:47:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:47:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47: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:47:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:47:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:53 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 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:53 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:47:53 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:47:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:47:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:47:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:47:53 INFO - 'HOME': '/Users/cltbld', 04:47:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:47:53 INFO - 'LOGNAME': 'cltbld', 04:47:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:47:53 INFO - 'MOZ_NO_REMOTE': '1', 04:47:53 INFO - 'NO_EM_RESTART': '1', 04:47:53 INFO - 'PAGER': '/bin/cat', 04:47:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:47:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:47:53 INFO - 'PWD': '/builds/slave/test', 04:47:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:47:53 INFO - 'SHELL': '/bin/bash', 04:47:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:47:53 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:47:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:47:53 INFO - 'USER': 'cltbld', 04:47:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:47:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:47:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:47:53 INFO - 'XPC_FLAGS': '0x0', 04:47:53 INFO - 'XPC_SERVICE_NAME': '0', 04:47:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:47:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:47:54 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-hKmvxQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:47:54 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:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:47:54 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-1O8MaL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:47:54 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:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:47:54 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-ikuuT_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:47:54 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:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:47:54 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-yhXxUT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:47:54 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:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:47:54 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-NlXWHR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:47:54 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:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:47:54 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-HJhI3_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:47:54 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:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:47:54 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-rA7tt1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:47:54 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:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:47:54 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-zXKU3b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-8I4kDj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-vJf8XE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-eES6xk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-tzQTII-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-7g9lQX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-xl_G5C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-Kj6lXM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-_IK8hk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:47:55 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:47:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:47:55 INFO - Running setup.py (path:/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/pip-wxsWM2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:47:56 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:47:56 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:47:56 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:47:56 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:47:56 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:47:56 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:47:56 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:47:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:47:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:47:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:47:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:47:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:47:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:47:58 INFO - Downloading blessings-1.6.tar.gz 04:47:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:47:58 INFO - Installing collected packages: blessings 04:47:58 INFO - Running setup.py install for blessings 04:47:58 INFO - Successfully installed blessings 04:47:58 INFO - Cleaning up... 04:47:58 INFO - Return code: 0 04:47:58 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:47:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:47:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:47:58 INFO - Reading from file tmpfile_stdout 04:47:58 INFO - Current package versions: 04:47:58 INFO - blessings == 1.6 04:47:58 INFO - blobuploader == 1.2.4 04:47:58 INFO - docopt == 0.6.1 04:47:58 INFO - manifestparser == 1.1 04:47:58 INFO - mozInstall == 1.12 04:47:58 INFO - mozcrash == 0.17 04:47:58 INFO - mozdebug == 0.1 04:47:58 INFO - mozdevice == 0.48 04:47:58 INFO - mozfile == 1.2 04:47:58 INFO - mozhttpd == 0.7 04:47:58 INFO - mozinfo == 0.9 04:47:58 INFO - mozleak == 0.1 04:47:58 INFO - mozlog == 3.1 04:47:58 INFO - moznetwork == 0.27 04:47:58 INFO - mozprocess == 0.22 04:47:58 INFO - mozprofile == 0.28 04:47:58 INFO - mozrunner == 6.11 04:47:58 INFO - mozscreenshot == 0.1 04:47:58 INFO - mozsystemmonitor == 0.0 04:47:58 INFO - moztest == 0.7 04:47:58 INFO - mozversion == 1.4 04:47:58 INFO - psutil == 3.1.1 04:47:58 INFO - requests == 1.2.3 04:47:58 INFO - wsgiref == 0.1.2 04:47:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:47:58 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:47:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:47:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:58 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:47:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:47:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:58 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 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:58 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:47:58 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:47:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:47:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:47:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:47:58 INFO - 'HOME': '/Users/cltbld', 04:47:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:47:58 INFO - 'LOGNAME': 'cltbld', 04:47:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:47:58 INFO - 'MOZ_NO_REMOTE': '1', 04:47:58 INFO - 'NO_EM_RESTART': '1', 04:47:58 INFO - 'PAGER': '/bin/cat', 04:47:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:47:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:47:58 INFO - 'PWD': '/builds/slave/test', 04:47:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:47:58 INFO - 'SHELL': '/bin/bash', 04:47:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:47:58 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:47:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:47:58 INFO - 'USER': 'cltbld', 04:47:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:47:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:47:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:47:58 INFO - 'XPC_FLAGS': '0x0', 04:47:58 INFO - 'XPC_SERVICE_NAME': '0', 04:47:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:47:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:47:59 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:47:59 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:47:59 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:47:59 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:47:59 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:47:59 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:47:59 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:47:59 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:47:59 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:47:59 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:47:59 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:47:59 INFO - Cleaning up... 04:47:59 INFO - Return code: 0 04:47:59 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:47:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:47:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:47:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:47:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:47:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:47:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:47:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:47:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:47:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:47:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:47:59 INFO - 'HOME': '/Users/cltbld', 04:47:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:47:59 INFO - 'LOGNAME': 'cltbld', 04:47:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:47:59 INFO - 'MOZ_NO_REMOTE': '1', 04:47:59 INFO - 'NO_EM_RESTART': '1', 04:47:59 INFO - 'PAGER': '/bin/cat', 04:47:59 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:47:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:47:59 INFO - 'PWD': '/builds/slave/test', 04:47:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:47:59 INFO - 'SHELL': '/bin/bash', 04:47:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:47:59 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:47:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:47:59 INFO - 'USER': 'cltbld', 04:47:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:47:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:47:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:47:59 INFO - 'XPC_FLAGS': '0x0', 04:47:59 INFO - 'XPC_SERVICE_NAME': '0', 04:47:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:47:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:47:59 INFO - Downloading/unpacking jsonschema 04:47:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:47:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:47:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:47:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:47:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:47:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:48:01 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:48:01 INFO - Downloading/unpacking functools32 (from jsonschema) 04:48: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:48: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:48: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:48: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:48: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:48: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:48:02 INFO - Downloading functools32-3.2.3-2.tar.gz 04:48:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:48:02 INFO - warning: no files found matching '*.txt' 04:48:02 INFO - no previously-included directories found matching 'build' 04:48:02 INFO - no previously-included directories found matching 'dist' 04:48:02 INFO - no previously-included directories found matching '.git*' 04:48:02 INFO - Installing collected packages: jsonschema, functools32 04:48:02 INFO - Running setup.py install for functools32 04:48:02 INFO - warning: no files found matching '*.txt' 04:48:02 INFO - no previously-included directories found matching 'build' 04:48:02 INFO - no previously-included directories found matching 'dist' 04:48:02 INFO - no previously-included directories found matching '.git*' 04:48:02 INFO - Successfully installed jsonschema functools32 04:48:02 INFO - Cleaning up... 04:48:02 INFO - Return code: 0 04:48:02 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:48:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:48:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:48:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:48:02 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 0x10d642a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d64a4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9861d3d9b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, '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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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:48:02 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:48:02 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:48:02 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:48:02 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:48:02 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:48:02 INFO - 'HOME': '/Users/cltbld', 04:48:02 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:48:02 INFO - 'LOGNAME': 'cltbld', 04:48:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:48:02 INFO - 'MOZ_NO_REMOTE': '1', 04:48:02 INFO - 'NO_EM_RESTART': '1', 04:48:02 INFO - 'PAGER': '/bin/cat', 04:48:02 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:48:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:48:02 INFO - 'PWD': '/builds/slave/test', 04:48:02 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:48:02 INFO - 'SHELL': '/bin/bash', 04:48:02 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:48:02 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:48:02 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:48:02 INFO - 'USER': 'cltbld', 04:48:02 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:48:02 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:48:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:48:02 INFO - 'XPC_FLAGS': '0x0', 04:48:02 INFO - 'XPC_SERVICE_NAME': '0', 04:48:02 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:48:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:48:02 INFO - Downloading/unpacking flake8 04:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:48:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:48:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:48:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:48:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:48:05 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:48:05 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:48:05 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:48:05 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:48:05 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:48:05 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:48:05 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:48:05 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:48:05 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:48:05 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:48:05 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:48:05 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:48:05 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:48:05 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:48:05 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:48:05 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:48:06 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:48:06 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:48:06 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:48:06 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:48:06 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:48:06 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:48:06 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:48:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:48:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:48:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:48:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:48:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:48:06 INFO - no previously-included directories found matching 'docs/_build' 04:48:06 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:48:06 INFO - Running setup.py install for pep8 04:48:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:48:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:48:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:48:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:48:06 INFO - no previously-included directories found matching 'docs/_build' 04:48:06 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:48:06 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:48:06 INFO - Cleaning up... 04:48:06 INFO - Return code: 0 04:48:06 INFO - Running post-action listener: _resource_record_post_action 04:48:06 INFO - Running post-action listener: _start_resource_monitoring 04:48:06 INFO - Starting resource monitoring. 04:48:06 INFO - ##### 04:48:06 INFO - ##### Running install step. 04:48:06 INFO - ##### 04:48:06 INFO - Running pre-action listener: _resource_record_pre_action 04:48:06 INFO - Running main action method: install 04:48:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:48:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:48:07 INFO - Reading from file tmpfile_stdout 04:48:07 INFO - Detecting whether we're running mozinstall >=1.0... 04:48:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:48:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:48:07 INFO - Reading from file tmpfile_stdout 04:48:07 INFO - Output received: 04:48:07 INFO - Usage: mozinstall [options] installer 04:48:07 INFO - Options: 04:48:07 INFO - -h, --help show this help message and exit 04:48:07 INFO - -d DEST, --destination=DEST 04:48:07 INFO - Directory to install application into. [default: 04:48:07 INFO - "/builds/slave/test"] 04:48:07 INFO - --app=APP Application being installed. [default: firefox] 04:48:07 INFO - mkdir: /builds/slave/test/build/application 04:48:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 04:48:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 04:48:41 INFO - Reading from file tmpfile_stdout 04:48:41 INFO - Output received: 04:48:41 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 04:48:41 INFO - Running post-action listener: _resource_record_post_action 04:48:41 INFO - ##### 04:48:41 INFO - ##### Running run-tests step. 04:48:41 INFO - ##### 04:48:41 INFO - Running pre-action listener: _resource_record_pre_action 04:48:41 INFO - Running main action method: run_tests 04:48:41 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 04:48:41 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 04:48:41 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 04:48:41 INFO - 2016-03-11 04:48:41.232 screenresolution[1641:7516] starting screenresolution argv=screenresolution get 04:48:41 INFO - 2016-03-11 04:48:41.234 screenresolution[1641:7516] Display 0: 1600x1200x32@60 04:48:41 INFO - 2016-03-11 04:48:41.240 screenresolution[1642:7518] starting screenresolution argv=screenresolution list 04:48:41 INFO - Available Modes on Display 0 04:48:41 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 04:48:41 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 04:48:41 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 04:48:41 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 04:48:41 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 04:48:41 INFO - Intel Iris: 04:48:41 INFO - Chipset Model: Intel Iris 04:48:41 INFO - Type: GPU 04:48:41 INFO - Bus: Built-In 04:48:41 INFO - VRAM (Dynamic, Max): 1536 MB 04:48:41 INFO - Vendor: Intel (0x8086) 04:48:41 INFO - Device ID: 0x0a2e 04:48:41 INFO - Revision ID: 0x0009 04:48:41 INFO - Displays: 04:48:41 INFO - Display: 04:48:41 INFO - Resolution: 1600 x 1200 @ 60 Hz 04:48:41 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 04:48:41 INFO - Display Serial Number: 1600x1200 60 04:48:41 INFO - Main Display: Yes 04:48:41 INFO - Mirror: Off 04:48:41 INFO - Online: Yes 04:48:41 INFO - Rotation: Supported 04:48:41 INFO - Return code: 0 04:48:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:48:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:48:41 INFO - Python 2.7.3 04:48:41 INFO - Return code: 0 04:48:41 INFO - grabbing minidump binary from tooltool 04:48:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:48:41 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 0x10d4e6d30>, '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 0x10d30adb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10d4ddb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:48:41 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:48:41 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:48:41 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:48:41 INFO - Return code: 0 04:48:41 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 04:48:41 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:48:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:48:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 04:48:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:48:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:48:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:48:42 INFO - Return code: 0 04:48:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0144', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 04:48:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0144 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 04:48:42 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.S0a2YIQ2Cz/Render', 04:48:42 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 04:48:42 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 04:48:42 INFO - 'HOME': '/Users/cltbld', 04:48:42 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 04:48:42 INFO - 'LOGNAME': 'cltbld', 04:48:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:48:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 04:48:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:48:42 INFO - 'MOZ_NO_REMOTE': '1', 04:48:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:48:42 INFO - 'NO_EM_RESTART': '1', 04:48:42 INFO - 'PAGER': '/bin/cat', 04:48:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 04:48:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:48:42 INFO - 'PWD': '/builds/slave/test', 04:48:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:48:42 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 04:48:42 INFO - 'SHELL': '/bin/bash', 04:48:42 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.04uOPKZgOa/Listeners', 04:48:42 INFO - 'TMPDIR': '/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/', 04:48:42 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 04:48:42 INFO - 'USER': 'cltbld', 04:48:42 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 04:48:42 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 04:48:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:48:42 INFO - 'XPC_FLAGS': '0x0', 04:48:42 INFO - 'XPC_SERVICE_NAME': '0', 04:48:42 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 04:48:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0144', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 04:48:42 INFO - mozversion application_buildid: 20160311025214 04:48:42 INFO - mozversion application_changeset: 102886e9ac63b3fa33a6f1b394aea054abce2dfd 04:48:42 INFO - mozversion application_display_name: Nightly 04:48:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:48:42 INFO - mozversion application_name: Firefox 04:48:42 INFO - mozversion application_remotingname: firefox 04:48:42 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:48:42 INFO - mozversion application_vendor: Mozilla 04:48:42 INFO - mozversion application_version: 48.0a1 04:48:42 INFO - mozversion platform_buildid: 20160311025214 04:48:42 INFO - mozversion platform_changeset: 102886e9ac63b3fa33a6f1b394aea054abce2dfd 04:48:42 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:48:42 INFO - mozversion platform_version: 48.0a1 04:48:42 INFO - using testdate: 1457700522 04:48:42 INFO - actual date: 1457700522 04:48:42 INFO - starting webserver on 'localhost:49270' 04:48:42 INFO - SUITE-START | Running 2 tests 04:48:42 INFO - TEST-START | dromaeo_css 04:48:42 INFO - operating with platform_type : mac_ 04:48:42 INFO - Initialising browser for dromaeo_css test... 04:48:42 INFO - TEST-INFO | started process 1660 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/tmpzBw59X/profile http://localhost:49270/getInfo.html) 04:48:45 INFO - PROCESS | 1660 | __metrics Screen width/height:1600/1200 04:48:45 INFO - PROCESS | 1660 | colorDepth:24 04:48:45 INFO - PROCESS | 1660 | Browser inner width/height: 1024/689 04:48:45 INFO - PROCESS | 1660 | __metrics 04:48:45 INFO - PROCESS | 1660 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 04:48:45 ERROR - PROCESS | 1660 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 04:48:45 INFO - TEST-INFO | 1660: exit 0 04:48:45 INFO - Browser initialized. 04:48:45 INFO - Running cycle 1/1 for dromaeo_css test... 04:48:45 INFO - TEST-INFO | started process 1663 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/tmpzBw59X/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:48:57 INFO - PROCESS | 1663 | RSS: Main: 243462144 04:48:57 INFO - PROCESS | 1663 | 04:49:49 INFO - PROCESS | 1663 | 1457700589132 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:51:59 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49270/tests/dromaeo/cssquery-ext.html) 04:52:00 INFO - PROCESS | 1663 | RSS: Main: 364527616 04:52:00 INFO - PROCESS | 1663 | 04:55:03 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-ext.html (next: http://localhost:49270/tests/dromaeo/cssquery-jquery.html) 04:55:03 INFO - PROCESS | 1663 | RSS: Main: 377053184 04:55:03 INFO - PROCESS | 1663 | 04:58:05 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49270/tests/dromaeo/cssquery-mootools.html) 04:58:06 INFO - PROCESS | 1663 | RSS: Main: 375476224 04:58:06 INFO - PROCESS | 1663 | 05:01:08 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49270/tests/dromaeo/cssquery-prototype.html) 05:01:09 INFO - PROCESS | 1663 | RSS: Main: 337629184 05:01:09 INFO - PROCESS | 1663 | 05:04:12 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49270/tests/dromaeo/cssquery-yui.html) 05:04:12 INFO - PROCESS | 1663 | RSS: Main: 335597568 05:04:12 INFO - PROCESS | 1663 | 05:07:15 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49270/tests/dromaeo/cssquery-yui.html (next: http://localhost:49270/tests/dromaeo/cssquery-dojo.html) 05:07:16 INFO - PROCESS | 1663 | RSS: Main: 379949056 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - PROCESS | 1663 | __start_tp_report 05:07:16 INFO - PROCESS | 1663 | _x_x_mozilla_page_load 05:07:16 INFO - PROCESS | 1663 | _x_x_mozilla_page_load_details 05:07:16 INFO - PROCESS | 1663 | |i|pagename|runs| 05:07:16 INFO - PROCESS | 1663 | |0;dojo.html;3397.6772206640367;3470.219200679846;3487.1107867493783;3489.319582681378;3541.256336169404;5501.257330260413;5560.277163968678;5623.212750214973;5631.5213206877415;5655.462731040549;5524.751386187621;5581.302337207849;5594.916076258859;5604.187392828037;5606.579506537016;5035.118854200518;5039.521245481674;5058.342415485981;5083.79664813407;5136.537711605954;5150.948490515084;5157;5163.664361816489;5167.483251674821;5179.922301165486;5049.6212784041345;5134.8716282093055;5151.845444636649;5155.072087024334;5164.586833053366;5159.509846564571;5196.948030519684;5206.661566998171;5208.322918020671;5268.81559145428;5016.573591244749;5047.621428392848;5048.444671086178;5120.436751957282;5127.743612819344;5441.1838224266285;5475.972620136914;5485.424030476823;5511.724413779295;5593.049181639131;6164.321924588292;6191.195144631214;6199.256089269272;6202.162708034448;6210.844728881769;6046.244219472566;6100.60346077508;6197.473214776749;6237.781677641261;6243.531735119885;5704.11586204139;5709.885802283972;5711.286089238845;5715.171300161495;5741.483266505993;6254.405831446005;6272.1219029335925;6291.716872740738;6314.652694101776;6331;5831.067029275296;6024.969875150597;6063.302720187146;6109.9816581254145;6122.908156377658;6133.26400831903;6205.503559715212;6209.130721698965;6212.254529456494;6212.627242365473;6090;6123.877522449615;6159.599626024384;6171.753129874754;6177.227846519185;6029.276486821609;6100.732564372368;6118.510519158545;6203.627782333075;6221.097940798559;4854.126257273725;4862.732549709729;4870.707757534559;4874.46380898101;4912.582430493448;4332.523422423531;4338.696291259645;4345.500267469281;4378.627816635558;4390.473143222834;5539.224508568804;5615.354234263031;5637.210790489335;5642.971785141131;5648.293963254593;6127.87524755443;6196.380361963767;6203.16257305267;6208.161898143693;6211.068339748984;4509.255972764523;5547.722613869371;5674.148877668383;5707.086866101404;5715.057015592464;5296.3379577552805;5317.069512835238;5325.094733895247;5325.707086110301;5326.97336513315;6222.564420490703;6301.52738544611;6303.338149494237;6307.810765677129;6313.873722525432;6102.4589553536725;6194.690265486798;6212.068189771389;6214.471769899609;6237.095621134819;6235.407636274546;6287.905681414691;6290.402411770874;6314.557980941474;6329.936700633119;5933.317668468181;6083.087536869505;6163.3836616338;6163.84590385244;6171.382861713792;4997;6190.659513726789;6192.938070619236;6194.845128871814;6217.502599792097;5991.2510936132985;6002.939970600412;6012.098185272069;6019.6990150493175;6063.060225665029;4082.7958602069184;5124.743762811919;5880.588358814842;6005.279366476051;6016.518678505797;5894.469497745224;5901.675407852609;5901.970490147522;5908.438698323653;5926.911096333472;6040.36576159497;6053.424924632153;6062.969685151546;6067.271927368567;6137.938620613737;4810.8797280068275;5741.368449470471;5816.563757718103;5847.035239185487;5947.821565353046 05:07:16 INFO - PROCESS | 1663 | |1;ext.html;492.4189456441398;576.1588081401154;580.8025271407721;625.7059182184372;629.5184184099165;30894.69105308949;31191.532127018083;31246.062618121436;31250.68749312506;31268.905588304413;31687;40405.98985025376;41367.58632413675;41380.793096034555;41486.58513414865;9626.1336479717;9804.362716423446;9807.970163132875;9839.212862970946;9843.90156098437;9606.951965240163;9758.072983066597;9767.218622510181;9772;9772.853407198898;9728.756781080494;9807.90192098077;9823.214142868554;9824.312298139133;9825.213982881389;9680.225581953462;9888.060634239735;9906.801863962752;9934.205263578897;9963.15313198379;9726.805463890752;9846.556904939294;9850.9507452463;9857.408555486694;9859.704208873745;41753.79123104365;42192.78903605462;42260.78869605663;42289.78855105705;42465.57534424647;3117.563541104247;3234.802007808137;3343.8328083595725;3440.6215316315183;3826.3877779555137;29179.85410072957;29357.944069220113;30458.086257412313;30544.389112217854;30670.386592268253;2755.2285360099204;2761.2682639100653;2765.640466739311;2846.1603826870914;2945.4698154332214;371742;372360;372465;372471;373997;69032;69230.65384673045;69393.65303173452;69691;69739.65130174317;73265.6336718313;73499.63250183822;73671.5265694683;73719.26280737124;73767;15637.68724625501;17396.21717022737;17639.559011024827;17658.82341176572;17663.293468261127;11703.122265830098;11764.470598823074;11767.646970590897;11776;13138.540151094665;15427.314827609329;19661.50846228856;21406.464838379165;21460.892695536422;21494.677579836316;8054.677812887418;8220.58897055145;8620.181082797124;8864.20222180007;8916.73249802507;892.8035832116924;962.5379817687549;1028.6039874648313;1054.5728979763207;1106.247751528952;28447.71552284492;28622.570661440095;29303.560446593317;29449.705502944696;30247.848760756497;1086.6468397770598;1094.6168840905618;1107.307932542161;1186.8694443611196;1208.2991864718442;13874.751272385332;14346.210958397389;14863.777043344358;14971;15417.152056636993;518626;524967;525011;525716;527556;62011;62135;62234.755304893646;62360;62390.75218495604;1311.1870640202944;1421.2609443089536;1466.948656797007;1469.897107202507;1475.9704805904037;28629.42741145207;29208.831646733892;29372.706272936997;29538.113856584336;29949;50701.42284348645;50793.49206507888;51426.228606571676;51439;51533.227001594256;352980;353588;355482;356678;356785;28780;33091.83454082714;33271.66728332686;33948.83025584856;34342.82828585841;42127.789361053;43108;43474.130517390106;43536.78231608822;43917;35492.645073548934;37483.625163748016;37499.43750843685;38329;38505.807470963584;28037.71962280351;36655.81672091623;36841.631583684895;37380;37817.432738508396;36091.458628120075;36144.915652530464;36656.81671591625;36931.6306836939;37406.438903417016;31103;31776;32125.839370802998;32301.51547726739;32441.675583243865;23905.880470597534;24047.75952240455;24183;24231.878840605685;24738.876305619076 05:07:16 INFO - PROCESS | 1663 | |2;jquery.html;363.3187772925764;365.0982074276538;369.72824973644373;372.0549803499111;374.52435407033084;19407;19718.605627887435;20253.797462025355;20258.594828103465;20273.391798246077;19402.223911043577;20076;20660.793392066076;20672.27647032354;21493.570128597457;5547.1679248112805;5739.51214146796;5743.9712801435935;5765.740541675635;5793.333766616851;4121.814518346681;4423.358613001113;5679.7160141992945;6314.526410519206;6315.305316415191;6054.243219597551;6261.311255761862;6265.530085243602;6274.090256912745;6277.811665650015;6032.396760323976;6159.568830181889;6220.968895155541;6227.564070515065;6251.031090181006;5369.62412631116;5382.4886635769935;5382.784688612451;5390.865228369283;5390.8921821563745;25403.61894571583;25889.611655825178;26092.695365231662;26121.346966325804;26194.73805261942;2059.6498595238695;2112.725345705064;2189.4635814225617;2250.167438047916;2250.2686626846175;12042.69893252667;14673.559793206221;14720.116792992454;14837.183954882477;14867.479638212719;1676.2038031934856;1706.650136721969;1764.876458647895;1796.9191386387645;1870.728744332078;105612.94387056108;111406;112038;112491.43754281258;112781;10298.948505257425;10511.894881051092;10742.3017503862;10742.462876856125;10866.565337386415;11101.889811018995;12682.80975785364;12894;12915.870841291655;12924.547640832525;8531.914680853237;8744.519051452104;8755.562221889008;8802.251808596213;8802.295816334678;7411.925880741232;9041.05068967762;9062.728118156467;9074.909250907538;9191.908080919238;5068.315777370008;6125.724342404603;6233.96883015582;6245.313015568284;6372.904406433907;1792.3816283382212;1801.4955812372557;1802.3961972739016;1809.0864113622536;1816.554944038719;942.5098948546854;950.2825366847985;983.4148681534475;1029.2280789407944;1031.4739482863793;20907.832219377688;20964.79035209659;21282.574348512942;21302.36092917184;22505.324840254492;942.5240253671852;1023.2019025160387;1029.6087486754984;1073.3897908483084;1073.640330489295;11101.666949991513;11401.48693308803;11527.285436117663;11534.94232528832;11662.241954272946;521223;605156;627819;642960;658063;93696;122907;125281;132070;133728.99406508714;1066.0618655583191;1079.2714917430546;1081.5944020992129;1082.24783775277;1107.7371796152393;15022.849771502146;18364.72452913234;18366.173522191802;18778.624427511648;19124.426267212006;50788.74605626948;51691.22463163131;51862.481375185766;52577;52783;72964.90552641609;73417;73828;73843.63078184574;74224;7820.452568320163;8002.239787220205;8039.437239393186;8080.383923215498;8489.53307568065;13232.073754837069;13271.469141234242;13494.98787590915;13717.862821372059;13789.034767566174;10138.732658417697;10548.894511054792;11482.024027957717;11716.70708232301;11780.646580602595;11398.94300528492;11451;11467.054060395454;11591.88408115908;11632.651020469399;11688.415579221175;11695.88304116948;11795.823062654239;11843.940780296043;11972.221805582609;7989.320907722677;8197;8228.670853165806;8255.060060885808;8476.957615211884;10325.070743633109;11575.01612362925;11828.822567661664;11886.227395219283;11952.820707689565 05:07:16 INFO - PROCESS | 1663 | |3;mootools.html;1432.813734214552;1511.4407669162408;1521.3078049487488;1801.9639607207855;1991.2333751505666;7885.723999660013;7945.523268603881;8711.477311361323;8744.387892847502;8752.081031491698;8342.541160236184;8606.311495080394;8612.61243244054;8612.8708069379;8616.138386161396;2420.842645228059;2442.413820683041;2451.178855083549;2452.6566280720713;2453.3008092693585;2414.843035202715;2442.157455677788;2462.6182941643983;2463.5072985402903;2478.8512689238614;2438.7076148420515;2453.472503411775;2467.950640987179;2471.406862353031;2476.021971321327;2433.9269821905373;2447.3514518652573;2453.0678342229926;2466.654668346415;2470.542949554338;2409;2449.130558651671;2454.49048834967;2460.6801115855005;2464.6179842124498;8448.197421245033;8669.479831210148;8686.348523860735;8725.520096394695;8779.868301975475;5347.839564813062;5547.3343198816;5551.584345991787;5553.861153471155;5559.193916882029;3505.0536355184213;3565.714742820568;3631.6186800385844;3648.4892115103908;3651.5618125824803;1014.5282443663658;1015.4313584392763;1035.2701345551368;1039.7660526381503;1056.0231785598291;11133.443327833576;11476.770464590745;11515;11522.596709115225;11572.884271157182;4856.344393506902;4888.242322440027;4933.062718083553;4950.975245123751;4972.875678108004;10018.949905250427;10022.248331375176;10022.448765317977;10024.79950400988;10043.849342259726;5464.699441530754;5506.311711036121;5511.035568775448;5519.586031047687;5554.888902221933;3989.261986532501;4482.887927801831;4562.064776720765;4916.631252656065;5027.069992051483;3913.5108111486065;3972.2651309507833;3981.3629819228786;4007.7996100194873;4032.3951407288555;1195.2768575012167;1241.4103300932165;1331.2544974814134;1343.2075075705382;1344.395022239996;1002.5187909803335;1010.0707349238718;1013.0679774607379;1014.0265345268625;1031.5564307347913;7853.096893857165;7983.481073730189;7992.040955085311;8012.118666946748;8020.278174964281;1026.7689769801734;1150.9597164099216;1151.4990978924195;1158.7219067423757;1191.7139886427194;5983.491403230774;6046.3046749624355;6195.31851496335;6196.287426945959;6198.783042593578;9980.301378903407;9998.1001709845;10319.48402579868;10375.636852710119;10457.895421045692;10073.69778906634;10199.694009179737;10274.023967723055;10291.588336466608;10348.275620706478;7729.729459468892;8019.077806052262;8225.753227403187;8304.958475207586;8333.083360830304;6661.800145995628;6919.962005699185;7686.730964416219;7877.7636670899965;7951.045874495097;9120.270378369847;9157.587908544265;9404.623815047322;9463.952680236554;9474.052594740471;9438.48088355147;9687.031296870256;9692.06158768235;9717.757056073655;9725;6773;6948.478864085315;6958.095447591781;7415.592142432218;7554.66004029809;7613.885791713018;7995.680172793023;8195.098539160568;8196.54918979462;8220.972378452694;7185.640717964186;7279.890801637874;7297.233790451926;7448.8882666758955;7506.624668766431;6077.6353418795015;6361.522885783492;7005.334493223136;7164.211936687065;7295.817604559928;6696.866062678817;7296.160941491584;7503.66233519482;7635.580043097683;7721.884171737541;6972.755953541805;6975.372216500539;7047.929520704727;7049.577025378494;7053.294670532906;7017.5087743859485;7042.542234754725;7067.469939754642;7073.752418665322;7097.503174777716 05:07:16 INFO - PROCESS | 1663 | |4;prototype.html;320.4568256804715;324.4743515504882;327.8770461077096;330.7635040945724;334.65530503581317;6360.522960777937;6415.582987105835;6449.16160899083;6462.418382345588;6505.219373675154;6367.617942923428;6371.490280777538;6377.808665740024;6436.034594810781;6449.613023218599;4499.1451624191295;4622.953770462303;4626.930596041062;4638.420197475316;4765.951490672055;4595.2188128018315;4630.143423466652;4640.327152562876;4669.392978912737;4695.859124226262;4637.652176086807;4651.581357677808;4658.883527911796;4661.463931647853;4669.673122881382;4686.390769199999;4693.507181745936;4699.271612900006;4701.905961880778;4709.987352719182;3881.1655494068627;3945.704072194597;4027.0335119571387;4049.372347286175;4066.369712694537;6032.306284777219;6053.606515576474;6089.756409743605;6111.51107911366;6117.938820611781;5509.063459211943;5515.917261241085;5517.531009864167;5522.282103326582;5527.50252477275;6755.9324406755795;6766.932330676728;6768.492363072789;6769.52613317068;6782.559133656297;4506.098780243931;4511.6165125964335;4513.300438432048;4519.751413672247;4525.932111018337;5648.3222013358245;7088.787336379917;7243.601601911892;7255.310745479223;7260.818479538001;3596.460530920383;4496.348029535699;4499.842505512357;4502.077074199781;4507;4577.473590537064;4579.473360563511;4579.6794224403975;4592.058627981256;4601.838935637236;5426.593005524602;5431.755570999236;5434.619576629677;5436.6194366393975;5440.211169380417;6863.553868998599;6878.105846239957;6878.793636190922;6882.311768823078;6888.448924086161;1511.833698293187;1572.2531797396373;1582.8179759327595;1584.1524784240607;1593.3785823528833;995.6316163019729;1020.9642662506776;1028.062102935971;1029.696239609317;1034.363866222268;5282.6302158849285;6131.417515336036;6299.779507717208;6309.337519560472;6341.778037768656;7196.172440169447;7203.351698347174;7211.206767255598;7212.062431883822;7216.5670059796585;6433.871322573522;6436.581622194542;6442.35576442352;6450.935490645127;6456.0961465394885;3729.813509324523;3775.7356985011334;3781.773093614392;3785.3943369060817;3788.0719223789797;7134.821629459201;7403.14863790671;7437.293457121565;7501;7533.7569301065805;6045.72794224261;7374.631268436557;7377.668004939791;7419.4806363554035;7439.367653749384;5639.971800140973;7523.623818809147;7534.3595794357;7539.547627142389;7541.4343924205905;7180.60506672138;7199.1001124859395;7201.819954501179;7214.386777123793;7226.421886248982;5455.454454554513;6840.726370945106;7099.728087012107;7112.715491380287;7142.857142857009;7466.954626352206;7496.8500629986;7508.774736757906;7517.736879209201;7519.774406767806;4489.595936365743;4520.841770538015;4526.841560545365;4528.841490547815;4577.885552861205;7117.644117793986;7121.750738724119;7138.428925686037;7278.381337586153;7286.052813134471;6589.934100658932;6883.070785444102;6900.758473453405;6908.93091069103;6911.30886911325;6819.386255237053;6871.381575658015;6882;6885.311468853075;6890;6718.7312507499155;6723.697433615597;6724.327567243236;6732.865342693217;6737.393634572716;5569.303837020372;6879.140107486564;6892.276310987274;6894.8621027580175;6914.896276555755;6394.1687580614225;6493.383128602775;6616.272210056986;6695.163104611924;6716.899246511404 05:07:16 INFO - PROCESS | 1663 | |5;yui.html;698.7554355975409;728.9380402665773;734.5666057026355;739.7521830186887;786.9252421020004;14758.557243282705;14967.326470308848;14976.625584360396;14983.400663973442;15028.173450460221;13689.17864928105;15596.738472921419;16026.5993350166;16039.518814435556;16101.597460063504;728.0389885351339;739.5156172706886;905.2350763604743;906.8775715278452;915.6062892956027;907.346710368537;922.2990527199344;922.9446233226028;924.1128516624049;924.2144177449181;972.5283237629744;977.8386566216566;980.8038392321564;981.3179840011195;981.7741919358516;769.4575324396287;957.9042095790435;969.5540051576284;971.1793534463367;978.5694294510392;720.8197950512372;721.1778572427385;721.9819504512377;722.0288711682779;722.6747963416484;15509.844901550952;15540.533783986499;15556.144412057332;15567.766483502757;15571.221438928009;11984.400779960966;12088.697782555419;12159.027277817753;12193.756124877453;12210.75578488434;9866.703998880044;10024.147947424477;10155.543000564918;10748.247622666417;10834.945825270823;3231.5314279429585;3563.55455568054;3632.128289210597;3645.143391303042;3653.8721144759807;75020;75391.24608753897;75791.99999999945;75890.62054689747;76091.47817043628;9257.39826911262;9335.533223338805;9462.195713364441;9499.572519236652;9898.752531186778;20555.075021624063;20794.48013799637;20826.062827172813;20862.165513379296;20862.687059694115;7397.8150546236775;7433.566780906905;7464.989141017065;7478.5138965967035;7497.10034795828;4044.5348784889525;4069.8168582413864;4085.4484644573195;4099.8360065597635;4408.559144085566;3582.659647333499;3625.5830579483695;3631.618680038558;3636.1818590816856;3653.1415117447377;657.9638119903451;670.0953712488199;670.2861452553016;673.7035704290097;673.8719643267764;534.188034188032;546.5845957072653;556.6354038105047;568.8919105369966;596.6658671144173;7827.647755850887;7992.84014319722;8241.629126689313;8259.21537453941;8347.332213422911;535.3976776126857;548.3529435266424;570.4267211452546;585.9794907178228;601.2124117406212;3210.967890321114;3781.962180378216;3809.771413715186;3851.383778595411;3929.7052721046034;93020.53489732643;94675;96813.51593241989;97172;97354;82632;82696;83248.58375708082;83540.16459835324;83749.74375384374;71454;71924;72132;72380;73846.8922966156;7721.189275126256;7783.649735761791;7914.960425197837;8049.718259860877;8054.637541310538;45419.772901135286;45579.54420455886;45768.084638307715;45964.08071838611;46896.531034689215;52256;54005.91988160293;55172.72413637906;58374.4162558369;62156.68921655363;9655.227581793299;9849.950750246202;9862.55618497155;9890.258230632588;10148.898511014795;8950.373473856767;9838;10604.257701960789;10647.733806654896;11009.889901100887;9993.250506211918;10075.745109478989;10265.230107742098;10506.632267870587;11090.390028548507;9864.753381165528;10290.742731431774;10385.896141038795;10507.211959103252;10670.679879603624;10991.505382257978;11334.093272538343;11431.330867381215;11534.649540120614;11600.825987610024;8404.991401031915;8572.571371431528;9433.091268285241;9501.762455938657;9552.283578731483;8628.947276422898;9039.186473217442;9431.952840235756;9517.571709272961;9749.561269742737 05:07:16 INFO - PROCESS | 1663 | __end_tp_report 05:07:16 INFO - PROCESS | 1663 | __start_cc_report 05:07:16 INFO - PROCESS | 1663 | _x_x_mozilla_cycle_collect,1078 05:07:16 INFO - PROCESS | 1663 | __end_cc_report 05:07:16 INFO - PROCESS | 1663 | __startTimestamp1457701636125__endTimestamp 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - PROCESS | 1663 | ------- Summary: start ------- 05:07:16 INFO - PROCESS | 1663 | Number of tests: 6 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - PROCESS | 1663 | [#0] dojo.html Cycles:165 Average:5646.88 Median:5847.04 stddev:649.26 (11.1%) stddev-sans-first:626.81 05:07:16 INFO - PROCESS | 1663 | Values: 3397.7 3470.2 3487.1 3489.3 3541.3 5501.3 5560.3 5623.2 5631.5 5655.5 5524.8 5581.3 5594.9 5604.2 5606.6 5035.1 5039.5 5058.3 5083.8 5136.5 5150.9 5157.0 5163.7 5167.5 5179.9 5049.6 5134.9 5151.8 5155.1 5164.6 5159.5 5196.9 5206.7 5208.3 5268.8 5016.6 5047.6 5048.4 5120.4 5127.7 5441.2 5476.0 5485.4 5511.7 5593.0 6164.3 6191.2 6199.3 6202.2 6210.8 6046.2 6100.6 6197.5 6237.8 6243.5 5704.1 5709.9 5711.3 5715.2 5741.5 6254.4 6272.1 6291.7 6314.7 6331.0 5831.1 6025.0 6063.3 6110.0 6122.9 6133.3 6205.5 6209.1 6212.3 6212.6 6090.0 6123.9 6159.6 6171.8 6177.2 6029.3 6100.7 6118.5 6203.6 6221.1 4854.1 4862.7 4870.7 4874.5 4912.6 4332.5 4338.7 4345.5 4378.6 4390.5 5539.2 5615.4 5637.2 5643.0 5648.3 6127.9 6196.4 6203.2 6208.2 6211.1 4509.3 5547.7 5674.1 5707.1 5715.1 5296.3 5317.1 5325.1 5325.7 5327.0 6222.6 6301.5 6303.3 6307.8 6313.9 6102.5 6194.7 6212.1 6214.5 6237.1 6235.4 6287.9 6290.4 6314.6 6329.9 5933.3 6083.1 6163.4 6163.8 6171.4 4997.0 6190.7 6192.9 6194.8 6217.5 5991.3 6002.9 6012.1 6019.7 6063.1 4082.8 5124.7 5880.6 6005.3 6016.5 5894.5 5901.7 5902.0 5908.4 5926.9 6040.4 6053.4 6063.0 6067.3 6137.9 4810.9 5741.4 5816.6 5847.0 5947.8 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - PROCESS | 1663 | [#1] ext.html Cycles:180 Average:57861.07 Median:204336.82 stddev:112518.01 (55.1%) stddev-sans-first:112751.21 05:07:16 INFO - PROCESS | 1663 | Values: 492.4 576.2 580.8 625.7 629.5 30894.7 31191.5 31246.1 31250.7 31268.9 31687.0 40406.0 41367.6 41380.8 41486.6 9626.1 9804.4 9808.0 9839.2 9843.9 9607.0 9758.1 9767.2 9772.0 9772.9 9728.8 9807.9 9823.2 9824.3 9825.2 9680.2 9888.1 9906.8 9934.2 9963.2 9726.8 9846.6 9851.0 9857.4 9859.7 41753.8 42192.8 42260.8 42289.8 42465.6 3117.6 3234.8 3343.8 3440.6 3826.4 29179.9 29357.9 30458.1 30544.4 30670.4 2755.2 2761.3 2765.6 2846.2 2945.5 371742.0 372360.0 372465.0 372471.0 373997.0 69032.0 69230.7 69393.7 69691.0 69739.7 73265.6 73499.6 73671.5 73719.3 73767.0 15637.7 17396.2 17639.6 17658.8 17663.3 11703.1 11764.5 11767.6 11776.0 13138.5 15427.3 19661.5 21406.5 21460.9 21494.7 8054.7 8220.6 8620.2 8864.2 8916.7 892.8 962.5 1028.6 1054.6 1106.2 28447.7 28622.6 29303.6 29449.7 30247.8 1086.6 1094.6 1107.3 1186.9 1208.3 13874.8 14346.2 14863.8 14971.0 15417.2 518626.0 524967.0 525011.0 525716.0 527556.0 62011.0 62135.0 62234.8 62360.0 62390.8 1311.2 1421.3 1466.9 1469.9 1476.0 28629.4 29208.8 29372.7 29538.1 29949.0 50701.4 50793.5 51426.2 51439.0 51533.2 352980.0 353588.0 355482.0 356678.0 356785.0 28780.0 33091.8 33271.7 33948.8 34342.8 42127.8 43108.0 43474.1 43536.8 43917.0 35492.6 37483.6 37499.4 38329.0 38505.8 28037.7 36655.8 36841.6 37380.0 37817.4 36091.5 36144.9 36656.8 36931.6 37406.4 31103.0 31776.0 32125.8 32301.5 32441.7 23905.9 24047.8 24183.0 24231.9 24738.9 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - PROCESS | 1663 | [#2] jquery.html Cycles:180 Average:35025.28 Median:20936.31 stddev:101803.85 (486.3%) stddev-sans-first:102056.16 05:07:16 INFO - PROCESS | 1663 | Values: 363.3 365.1 369.7 372.1 374.5 19407.0 19718.6 20253.8 20258.6 20273.4 19402.2 20076.0 20660.8 20672.3 21493.6 5547.2 5739.5 5744.0 5765.7 5793.3 4121.8 4423.4 5679.7 6314.5 6315.3 6054.2 6261.3 6265.5 6274.1 6277.8 6032.4 6159.6 6221.0 6227.6 6251.0 5369.6 5382.5 5382.8 5390.9 5390.9 25403.6 25889.6 26092.7 26121.3 26194.7 2059.6 2112.7 2189.5 2250.2 2250.3 12042.7 14673.6 14720.1 14837.2 14867.5 1676.2 1706.7 1764.9 1796.9 1870.7 105612.9 111406.0 112038.0 112491.4 112781.0 10298.9 10511.9 10742.3 10742.5 10866.6 11101.9 12682.8 12894.0 12915.9 12924.5 8531.9 8744.5 8755.6 8802.3 8802.3 7411.9 9041.1 9062.7 9074.9 9191.9 5068.3 6125.7 6234.0 6245.3 6372.9 1792.4 1801.5 1802.4 1809.1 1816.6 942.5 950.3 983.4 1029.2 1031.5 20907.8 20964.8 21282.6 21302.4 22505.3 942.5 1023.2 1029.6 1073.4 1073.6 11101.7 11401.5 11527.3 11534.9 11662.2 521223.0 605156.0 627819.0 642960.0 658063.0 93696.0 122907.0 125281.0 132070.0 133729.0 1066.1 1079.3 1081.6 1082.2 1107.7 15022.8 18364.7 18366.2 18778.6 19124.4 50788.7 51691.2 51862.5 52577.0 52783.0 72964.9 73417.0 73828.0 73843.6 74224.0 7820.5 8002.2 8039.4 8080.4 8489.5 13232.1 13271.5 13495.0 13717.9 13789.0 10138.7 10548.9 11482.0 11716.7 11780.6 11398.9 11451.0 11467.1 11591.9 11632.7 11688.4 11695.9 11795.8 11843.9 11972.2 7989.3 8197.0 8228.7 8255.1 8477.0 10325.1 11575.0 11828.8 11886.2 11952.8 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - PROCESS | 1663 | [#3] mootools.html Cycles:180 Average:5928.67 Median:5508.67 stddev:3080.22 (55.9%) stddev-sans-first:3070.32 05:07:16 INFO - PROCESS | 1663 | Values: 1432.8 1511.4 1521.3 1802.0 1991.2 7885.7 7945.5 8711.5 8744.4 8752.1 8342.5 8606.3 8612.6 8612.9 8616.1 2420.8 2442.4 2451.2 2452.7 2453.3 2414.8 2442.2 2462.6 2463.5 2478.9 2438.7 2453.5 2468.0 2471.4 2476.0 2433.9 2447.4 2453.1 2466.7 2470.5 2409.0 2449.1 2454.5 2460.7 2464.6 8448.2 8669.5 8686.3 8725.5 8779.9 5347.8 5547.3 5551.6 5553.9 5559.2 3505.1 3565.7 3631.6 3648.5 3651.6 1014.5 1015.4 1035.3 1039.8 1056.0 11133.4 11476.8 11515.0 11522.6 11572.9 4856.3 4888.2 4933.1 4951.0 4972.9 10018.9 10022.2 10022.4 10024.8 10043.8 5464.7 5506.3 5511.0 5519.6 5554.9 3989.3 4482.9 4562.1 4916.6 5027.1 3913.5 3972.3 3981.4 4007.8 4032.4 1195.3 1241.4 1331.3 1343.2 1344.4 1002.5 1010.1 1013.1 1014.0 1031.6 7853.1 7983.5 7992.0 8012.1 8020.3 1026.8 1151.0 1151.5 1158.7 1191.7 5983.5 6046.3 6195.3 6196.3 6198.8 9980.3 9998.1 10319.5 10375.6 10457.9 10073.7 10199.7 10274.0 10291.6 10348.3 7729.7 8019.1 8225.8 8305.0 8333.1 6661.8 6920.0 7686.7 7877.8 7951.0 9120.3 9157.6 9404.6 9464.0 9474.1 9438.5 9687.0 9692.1 9717.8 9725.0 6773.0 6948.5 6958.1 7415.6 7554.7 7613.9 7995.7 8195.1 8196.5 8221.0 7185.6 7279.9 7297.2 7448.9 7506.6 6077.6 6361.5 7005.3 7164.2 7295.8 6696.9 7296.2 7503.7 7635.6 7721.9 6972.8 6975.4 7047.9 7049.6 7053.3 7017.5 7042.5 7067.5 7073.8 7097.5 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - PROCESS | 1663 | [#4] prototype.html Cycles:180 Average:5593.70 Median:6369.55 stddev:1800.65 (28.3%) stddev-sans-first:1761.67 05:07:16 INFO - PROCESS | 1663 | Values: 320.5 324.5 327.9 330.8 334.7 6360.5 6415.6 6449.2 6462.4 6505.2 6367.6 6371.5 6377.8 6436.0 6449.6 4499.1 4623.0 4626.9 4638.4 4766.0 4595.2 4630.1 4640.3 4669.4 4695.9 4637.7 4651.6 4658.9 4661.5 4669.7 4686.4 4693.5 4699.3 4701.9 4710.0 3881.2 3945.7 4027.0 4049.4 4066.4 6032.3 6053.6 6089.8 6111.5 6117.9 5509.1 5515.9 5517.5 5522.3 5527.5 6755.9 6766.9 6768.5 6769.5 6782.6 4506.1 4511.6 4513.3 4519.8 4525.9 5648.3 7088.8 7243.6 7255.3 7260.8 3596.5 4496.3 4499.8 4502.1 4507.0 4577.5 4579.5 4579.7 4592.1 4601.8 5426.6 5431.8 5434.6 5436.6 5440.2 6863.6 6878.1 6878.8 6882.3 6888.4 1511.8 1572.3 1582.8 1584.2 1593.4 995.6 1021.0 1028.1 1029.7 1034.4 5282.6 6131.4 6299.8 6309.3 6341.8 7196.2 7203.4 7211.2 7212.1 7216.6 6433.9 6436.6 6442.4 6450.9 6456.1 3729.8 3775.7 3781.8 3785.4 3788.1 7134.8 7403.1 7437.3 7501.0 7533.8 6045.7 7374.6 7377.7 7419.5 7439.4 5640.0 7523.6 7534.4 7539.5 7541.4 7180.6 7199.1 7201.8 7214.4 7226.4 5455.5 6840.7 7099.7 7112.7 7142.9 7467.0 7496.9 7508.8 7517.7 7519.8 4489.6 4520.8 4526.8 4528.8 4577.9 7117.6 7121.8 7138.4 7278.4 7286.1 6589.9 6883.1 6900.8 6908.9 6911.3 6819.4 6871.4 6882.0 6885.3 6890.0 6718.7 6723.7 6724.3 6732.9 6737.4 5569.3 6879.1 6892.3 6894.9 6914.9 6394.2 6493.4 6616.3 6695.2 6716.9 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - PROCESS | 1663 | [#5] yui.html Cycles:180 Average:17889.00 Median:686.31 stddev:25501.40 (3715.7%) stddev-sans-first:25540.27 05:07:16 INFO - PROCESS | 1663 | Values: 698.8 728.9 734.6 739.8 786.9 14758.6 14967.3 14976.6 14983.4 15028.2 13689.2 15596.7 16026.6 16039.5 16101.6 728.0 739.5 905.2 906.9 915.6 907.3 922.3 922.9 924.1 924.2 972.5 977.8 980.8 981.3 981.8 769.5 957.9 969.6 971.2 978.6 720.8 721.2 722.0 722.0 722.7 15509.8 15540.5 15556.1 15567.8 15571.2 11984.4 12088.7 12159.0 12193.8 12210.8 9866.7 10024.1 10155.5 10748.2 10834.9 3231.5 3563.6 3632.1 3645.1 3653.9 75020.0 75391.2 75792.0 75890.6 76091.5 9257.4 9335.5 9462.2 9499.6 9898.8 20555.1 20794.5 20826.1 20862.2 20862.7 7397.8 7433.6 7465.0 7478.5 7497.1 4044.5 4069.8 4085.4 4099.8 4408.6 3582.7 3625.6 3631.6 3636.2 3653.1 658.0 670.1 670.3 673.7 673.9 534.2 546.6 556.6 568.9 596.7 7827.6 7992.8 8241.6 8259.2 8347.3 535.4 548.4 570.4 586.0 601.2 3211.0 3782.0 3809.8 3851.4 3929.7 93020.5 94675.0 96813.5 97172.0 97354.0 82632.0 82696.0 83248.6 83540.2 83749.7 71454.0 71924.0 72132.0 72380.0 73846.9 7721.2 7783.6 7915.0 8049.7 8054.6 45419.8 45579.5 45768.1 45964.1 46896.5 52256.0 54005.9 55172.7 58374.4 62156.7 9655.2 9850.0 9862.6 9890.3 10148.9 8950.4 9838.0 10604.3 10647.7 11009.9 9993.3 10075.7 10265.2 10506.6 11090.4 9864.8 10290.7 10385.9 10507.2 10670.7 10991.5 11334.1 11431.3 11534.6 11600.8 8405.0 8572.6 9433.1 9501.8 9552.3 8628.9 9039.2 9432.0 9517.6 9749.6 05:07:16 INFO - PROCESS | 1663 | -------- Summary: end -------- 05:07:16 INFO - PROCESS | 1663 | 05:07:16 INFO - TEST-INFO | 1663: exit 0 05:07:16 INFO - TEST-OK | dromaeo_css | took 1113712ms 05:07:16 INFO - TEST-START | kraken 05:07:16 INFO - operating with platform_type : mac_ 05:07:16 INFO - Initialising browser for kraken test... 05:07:16 INFO - TEST-INFO | started process 1674 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/tmpPbneNO/profile http://localhost:49270/getInfo.html) 05:07:18 INFO - PROCESS | 1674 | __metrics Screen width/height:1600/1200 05:07:18 INFO - PROCESS | 1674 | colorDepth:24 05:07:18 INFO - PROCESS | 1674 | Browser inner width/height: 1024/689 05:07:18 INFO - PROCESS | 1674 | __metrics 05:07:18 INFO - PROCESS | 1674 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 05:07:18 ERROR - PROCESS | 1674 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 05:07:19 INFO - TEST-INFO | 1674: exit 0 05:07:19 INFO - Browser initialized. 05:07:19 INFO - Running cycle 1/1 for kraken test... 05:07:19 INFO - TEST-INFO | started process 1676 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/T/tmpPbneNO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:07:31 INFO - PROCESS | 1676 | RSS: Main: 242962432 05:07:31 INFO - PROCESS | 1676 | 05:07:33 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-beat-detection) 05:07:34 INFO - PROCESS | 1676 | RSS: Main: 288575488 05:07:34 INFO - PROCESS | 1676 | 05:07:37 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-dft) 05:07:37 INFO - PROCESS | 1676 | RSS: Main: 299507712 05:07:37 INFO - PROCESS | 1676 | 05:07:40 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-fft) 05:07:41 INFO - PROCESS | 1676 | RSS: Main: 285315072 05:07:41 INFO - PROCESS | 1676 | 05:07:43 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49270/tests/kraken/driver.html?testName=audio-oscillator) 05:07:44 INFO - PROCESS | 1676 | RSS: Main: 288194560 05:07:44 INFO - PROCESS | 1676 | 05:07:46 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:07:46 INFO - PROCESS | 1676 | RSS: Main: 290545664 05:07:46 INFO - PROCESS | 1676 | 05:07:49 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-darkroom) 05:07:50 INFO - PROCESS | 1676 | RSS: Main: 290586624 05:07:50 INFO - PROCESS | 1676 | 05:07:52 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49270/tests/kraken/driver.html?testName=imaging-desaturate) 05:07:53 INFO - PROCESS | 1676 | RSS: Main: 289792000 05:07:53 INFO - PROCESS | 1676 | 05:07:56 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49270/tests/kraken/driver.html?testName=json-parse-financial) 05:07:57 INFO - PROCESS | 1676 | RSS: Main: 291282944 05:07:57 INFO - PROCESS | 1676 | 05:07:58 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49270/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:07:59 INFO - PROCESS | 1676 | RSS: Main: 324063232 05:07:59 INFO - PROCESS | 1676 | 05:08:01 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:08:01 INFO - PROCESS | 1676 | RSS: Main: 323522560 05:08:01 INFO - PROCESS | 1676 | 05:08:03 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:08:04 INFO - PROCESS | 1676 | RSS: Main: 331698176 05:08:04 INFO - PROCESS | 1676 | 05:08:07 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:08:07 INFO - PROCESS | 1676 | RSS: Main: 333115392 05:08:07 INFO - PROCESS | 1676 | 05:08:10 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:08:10 INFO - PROCESS | 1676 | RSS: Main: 334123008 05:08:10 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | Cycle 1(1): loaded http://localhost:49270/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49270/tests/kraken/driver.html?testName=ai-astar) 05:08:12 INFO - PROCESS | 1676 | RSS: Main: 394055680 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | __start_tp_report 05:08:12 INFO - PROCESS | 1676 | _x_x_mozilla_page_load 05:08:12 INFO - PROCESS | 1676 | _x_x_mozilla_page_load_details 05:08:12 INFO - PROCESS | 1676 | |i|pagename|runs| 05:08:12 INFO - PROCESS | 1676 | |0;ai-astar;111;107;111;111;111;111;117;110;110;111 05:08:12 INFO - PROCESS | 1676 | |1;audio-beat-detection;157;123;144;157;123;140;135;119;158;107 05:08:12 INFO - PROCESS | 1676 | |2;audio-dft;193;186;186;185;186;186;184;185;179;182 05:08:12 INFO - PROCESS | 1676 | |3;audio-fft;78;74;85;78;57;57;57;79;79;72 05:08:12 INFO - PROCESS | 1676 | |4;audio-oscillator;96;92;130;89;115;120;117;76;79;116 05:08:12 INFO - PROCESS | 1676 | |5;imaging-gaussian-blur;88;84;93;130;87;85;89;85;86;85 05:08:12 INFO - PROCESS | 1676 | |6;imaging-darkroom;102;121;93;95;94;94;93;94;93;92 05:08:12 INFO - PROCESS | 1676 | |7;imaging-desaturate;87;86;88;88;87;87;87;86;100;142 05:08:12 INFO - PROCESS | 1676 | |8;json-parse-financial;54;55;56;55;53;54;56;66;57;54 05:08:12 INFO - PROCESS | 1676 | |9;json-stringify-tinderbox;63;82;119;113;85;66;67;67;68;67 05:08:12 INFO - PROCESS | 1676 | |10;stanford-crypto-aes;83;84;98;107;106;98;82;81;83;81 05:08:12 INFO - PROCESS | 1676 | |11;stanford-crypto-ccm;123;120;121;124;120;128;129;132;105;136 05:08:12 INFO - PROCESS | 1676 | |12;stanford-crypto-pbkdf2;142;127;127;138;137;129;138;140;137;136 05:08:12 INFO - PROCESS | 1676 | |13;stanford-crypto-sha256-iterative;66;69;71;99;97;97;95;93;74;66 05:08:12 INFO - PROCESS | 1676 | __end_tp_report 05:08:12 INFO - PROCESS | 1676 | __start_cc_report 05:08:12 INFO - PROCESS | 1676 | _x_x_mozilla_cycle_collect,1271 05:08:12 INFO - PROCESS | 1676 | __end_cc_report 05:08:12 INFO - PROCESS | 1676 | __startTimestamp1457701692905__endTimestamp 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | ------- Summary: start ------- 05:08:12 INFO - PROCESS | 1676 | Number of tests: 14 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#0] ai-astar Cycles:10 Average:111.00 Median:111.00 stddev:2.45 (2.2%) stddev-sans-first:2.60 05:08:12 INFO - PROCESS | 1676 | Values: 111.0 107.0 111.0 111.0 111.0 111.0 117.0 110.0 110.0 111.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#1] audio-beat-detection Cycles:10 Average:136.30 Median:142.00 stddev:17.99 (12.7%) stddev-sans-first:17.46 05:08:12 INFO - PROCESS | 1676 | Values: 157.0 123.0 144.0 157.0 123.0 140.0 135.0 119.0 158.0 107.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#2] audio-dft Cycles:10 Average:185.20 Median:186.00 stddev:3.55 (1.9%) stddev-sans-first:2.40 05:08:12 INFO - PROCESS | 1676 | Values: 193.0 186.0 186.0 185.0 186.0 186.0 184.0 185.0 179.0 182.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#3] audio-fft Cycles:10 Average:71.60 Median:78.00 stddev:10.63 (13.6%) stddev-sans-first:11.02 05:08:12 INFO - PROCESS | 1676 | Values: 78.0 74.0 85.0 78.0 57.0 57.0 57.0 79.0 79.0 72.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#4] audio-oscillator Cycles:10 Average:103.00 Median:77.50 stddev:18.85 (24.3%) stddev-sans-first:19.82 05:08:12 INFO - PROCESS | 1676 | Values: 96.0 92.0 130.0 89.0 115.0 120.0 117.0 76.0 79.0 116.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#5] imaging-gaussian-blur Cycles:10 Average:91.20 Median:86.50 stddev:13.89 (16.1%) stddev-sans-first:14.68 05:08:12 INFO - PROCESS | 1676 | Values: 88.0 84.0 93.0 130.0 87.0 85.0 89.0 85.0 86.0 85.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#6] imaging-darkroom Cycles:10 Average:97.10 Median:93.50 stddev:8.85 (9.5%) stddev-sans-first:9.21 05:08:12 INFO - PROCESS | 1676 | Values: 102.0 121.0 93.0 95.0 94.0 94.0 93.0 94.0 93.0 92.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#7] imaging-desaturate Cycles:10 Average:93.80 Median:87.00 stddev:17.43 (20.0%) stddev-sans-first:18.32 05:08:12 INFO - PROCESS | 1676 | Values: 87.0 86.0 88.0 88.0 87.0 87.0 87.0 86.0 100.0 142.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#8] json-parse-financial Cycles:10 Average:56.00 Median:55.50 stddev:3.71 (6.7%) stddev-sans-first:3.87 05:08:12 INFO - PROCESS | 1676 | Values: 54.0 55.0 56.0 55.0 53.0 54.0 56.0 66.0 57.0 54.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#9] json-stringify-tinderbox Cycles:10 Average:79.70 Median:67.00 stddev:20.48 (30.6%) stddev-sans-first:20.81 05:08:12 INFO - PROCESS | 1676 | Values: 63.0 82.0 119.0 113.0 85.0 66.0 67.0 67.0 68.0 67.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#10] stanford-crypto-aes Cycles:10 Average:90.30 Median:83.00 stddev:10.71 (12.9%) stddev-sans-first:11.03 05:08:12 INFO - PROCESS | 1676 | Values: 83.0 84.0 98.0 107.0 106.0 98.0 82.0 81.0 83.0 81.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#11] stanford-crypto-ccm Cycles:10 Average:123.80 Median:126.00 stddev:8.51 (6.8%) stddev-sans-first:9.02 05:08:12 INFO - PROCESS | 1676 | Values: 123.0 120.0 121.0 124.0 120.0 128.0 129.0 132.0 105.0 136.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:135.10 Median:137.50 stddev:5.43 (3.9%) stddev-sans-first:5.15 05:08:12 INFO - PROCESS | 1676 | Values: 142.0 127.0 127.0 138.0 137.0 129.0 138.0 140.0 137.0 136.0 05:08:12 INFO - PROCESS | 1676 | 05:08:12 INFO - PROCESS | 1676 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:82.70 Median:94.00 stddev:14.49 (15.4%) stddev-sans-first:14.05 05:08:12 INFO - PROCESS | 1676 | Values: 66.0 69.0 71.0 99.0 97.0 97.0 95.0 93.0 74.0 66.0 05:08:12 INFO - PROCESS | 1676 | -------- Summary: end -------- 05:08:12 INFO - PROCESS | 1676 | 05:08:13 INFO - TEST-INFO | 1676: exit 0 05:08:13 INFO - TEST-OK | kraken | took 56979ms 05:08:13 INFO - SUITE-END | took 1170s 05:08:14 INFO - Completed test suite (00:19:31) 05:08:14 INFO - javascript benchmark 05:08:14 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3397.6772206640367, 3470.219200679846, 3487.1107867493783, 3489.319582681378, 3541.256336169404, 5501.257330260413, 5560.277163968678, 5623.212750214973, 5631.5213206877415, 5655.462731040549, 5524.751386187621, 5581.302337207849, 5594.916076258859, 5604.187392828037, 5606.579506537016, 5035.118854200518, 5039.521245481674, 5058.342415485981, 5083.79664813407, 5136.537711605954, 5150.948490515084, 5157.0, 5163.664361816489, 5167.483251674821, 5179.922301165486, 5049.6212784041345, 5134.8716282093055, 5151.845444636649, 5155.072087024334, 5164.586833053366, 5159.509846564571, 5196.948030519684, 5206.661566998171, 5208.322918020671, 5268.81559145428, 5016.573591244749, 5047.621428392848, 5048.444671086178, 5120.436751957282, 5127.743612819344, 5441.1838224266285, 5475.972620136914, 5485.424030476823, 5511.724413779295, 5593.049181639131, 6164.321924588292, 6191.195144631214, 6199.256089269272, 6202.162708034448, 6210.844728881769, 6046.244219472566, 6100.60346077508, 6197.473214776749, 6237.781677641261, 6243.531735119885, 5704.11586204139, 5709.885802283972, 5711.286089238845, 5715.171300161495, 5741.483266505993, 6254.405831446005, 6272.1219029335925, 6291.716872740738, 6314.652694101776, 6331.0, 5831.067029275296, 6024.969875150597, 6063.302720187146, 6109.9816581254145, 6122.908156377658, 6133.26400831903, 6205.503559715212, 6209.130721698965, 6212.254529456494, 6212.627242365473, 6090.0, 6123.877522449615, 6159.599626024384, 6171.753129874754, 6177.227846519185, 6029.276486821609, 6100.732564372368, 6118.510519158545, 6203.627782333075, 6221.097940798559, 4854.126257273725, 4862.732549709729, 4870.707757534559, 4874.46380898101, 4912.582430493448, 4332.523422423531, 4338.696291259645, 4345.500267469281, 4378.627816635558, 4390.473143222834, 5539.224508568804, 5615.354234263031, 5637.210790489335, 5642.971785141131, 5648.293963254593, 6127.87524755443, 6196.380361963767, 6203.16257305267, 6208.161898143693, 6211.068339748984, 4509.255972764523, 5547.722613869371, 5674.148877668383, 5707.086866101404, 5715.057015592464, 5296.3379577552805, 5317.069512835238, 5325.094733895247, 5325.707086110301, 5326.97336513315, 6222.564420490703, 6301.52738544611, 6303.338149494237, 6307.810765677129, 6313.873722525432, 6102.4589553536725, 6194.690265486798, 6212.068189771389, 6214.471769899609, 6237.095621134819, 6235.407636274546, 6287.905681414691, 6290.402411770874, 6314.557980941474, 6329.936700633119, 5933.317668468181, 6083.087536869505, 6163.3836616338, 6163.84590385244, 6171.382861713792, 4997.0, 6190.659513726789, 6192.938070619236, 6194.845128871814, 6217.502599792097, 5991.2510936132985, 6002.939970600412, 6012.098185272069, 6019.6990150493175, 6063.060225665029, 4082.7958602069184, 5124.743762811919, 5880.588358814842, 6005.279366476051, 6016.518678505797, 5894.469497745224, 5901.675407852609, 5901.970490147522, 5908.438698323653, 5926.911096333472, 6040.36576159497, 6053.424924632153, 6062.969685151546, 6067.271927368567, 6137.938620613737, 4810.8797280068275, 5741.368449470471, 5816.563757718103, 5847.035239185487, 5947.821565353046], "unit": "score", "name": "dojo.html", "value": 5608.033541892856}, {"lowerIsBetter": false, "replicates": [492.4189456441398, 576.1588081401154, 580.8025271407721, 625.7059182184372, 629.5184184099165, 30894.69105308949, 31191.532127018083, 31246.062618121436, 31250.68749312506, 31268.905588304413, 31687.0, 40405.98985025376, 41367.58632413675, 41380.793096034555, 41486.58513414865, 9626.1336479717, 9804.362716423446, 9807.970163132875, 9839.212862970946, 9843.90156098437, 9606.951965240163, 9758.072983066597, 9767.218622510181, 9772.0, 9772.853407198898, 9728.756781080494, 9807.90192098077, 9823.214142868554, 9824.312298139133, 9825.213982881389, 9680.225581953462, 9888.060634239735, 9906.801863962752, 9934.205263578897, 9963.15313198379, 9726.805463890752, 9846.556904939294, 9850.9507452463, 9857.408555486694, 9859.704208873745, 41753.79123104365, 42192.78903605462, 42260.78869605663, 42289.78855105705, 42465.57534424647, 3117.563541104247, 3234.802007808137, 3343.8328083595725, 3440.6215316315183, 3826.3877779555137, 29179.85410072957, 29357.944069220113, 30458.086257412313, 30544.389112217854, 30670.386592268253, 2755.2285360099204, 2761.2682639100653, 2765.640466739311, 2846.1603826870914, 2945.4698154332214, 371742.0, 372360.0, 372465.0, 372471.0, 373997.0, 69032.0, 69230.65384673045, 69393.65303173452, 69691.0, 69739.65130174317, 73265.6336718313, 73499.63250183822, 73671.5265694683, 73719.26280737124, 73767.0, 15637.68724625501, 17396.21717022737, 17639.559011024827, 17658.82341176572, 17663.293468261127, 11703.122265830098, 11764.470598823074, 11767.646970590897, 11776.0, 13138.540151094665, 15427.314827609329, 19661.50846228856, 21406.464838379165, 21460.892695536422, 21494.677579836316, 8054.677812887418, 8220.58897055145, 8620.181082797124, 8864.20222180007, 8916.73249802507, 892.8035832116924, 962.5379817687549, 1028.6039874648313, 1054.5728979763207, 1106.247751528952, 28447.71552284492, 28622.570661440095, 29303.560446593317, 29449.705502944696, 30247.848760756497, 1086.6468397770598, 1094.6168840905618, 1107.307932542161, 1186.8694443611196, 1208.2991864718442, 13874.751272385332, 14346.210958397389, 14863.777043344358, 14971.0, 15417.152056636993, 518626.0, 524967.0, 525011.0, 525716.0, 527556.0, 62011.0, 62135.0, 62234.755304893646, 62360.0, 62390.75218495604, 1311.1870640202944, 1421.2609443089536, 1466.948656797007, 1469.897107202507, 1475.9704805904037, 28629.42741145207, 29208.831646733892, 29372.706272936997, 29538.113856584336, 29949.0, 50701.42284348645, 50793.49206507888, 51426.228606571676, 51439.0, 51533.227001594256, 352980.0, 353588.0, 355482.0, 356678.0, 356785.0, 28780.0, 33091.83454082714, 33271.66728332686, 33948.83025584856, 34342.82828585841, 42127.789361053, 43108.0, 43474.130517390106, 43536.78231608822, 43917.0, 35492.645073548934, 37483.625163748016, 37499.43750843685, 38329.0, 38505.807470963584, 28037.71962280351, 36655.81672091623, 36841.631583684895, 37380.0, 37817.432738508396, 36091.458628120075, 36144.915652530464, 36656.81671591625, 36931.6306836939, 37406.438903417016, 31103.0, 31776.0, 32125.839370802998, 32301.51547726739, 32441.675583243865, 23905.880470597534, 24047.75952240455, 24183.0, 24231.878840605685, 24738.876305619076], "unit": "score", "name": "ext.html", "value": 19613.19635113089}, {"lowerIsBetter": false, "replicates": [363.3187772925764, 365.0982074276538, 369.72824973644373, 372.0549803499111, 374.52435407033084, 19407.0, 19718.605627887435, 20253.797462025355, 20258.594828103465, 20273.391798246077, 19402.223911043577, 20076.0, 20660.793392066076, 20672.27647032354, 21493.570128597457, 5547.1679248112805, 5739.51214146796, 5743.9712801435935, 5765.740541675635, 5793.333766616851, 4121.814518346681, 4423.358613001113, 5679.7160141992945, 6314.526410519206, 6315.305316415191, 6054.243219597551, 6261.311255761862, 6265.530085243602, 6274.090256912745, 6277.811665650015, 6032.396760323976, 6159.568830181889, 6220.968895155541, 6227.564070515065, 6251.031090181006, 5369.62412631116, 5382.4886635769935, 5382.784688612451, 5390.865228369283, 5390.8921821563745, 25403.61894571583, 25889.611655825178, 26092.695365231662, 26121.346966325804, 26194.73805261942, 2059.6498595238695, 2112.725345705064, 2189.4635814225617, 2250.167438047916, 2250.2686626846175, 12042.69893252667, 14673.559793206221, 14720.116792992454, 14837.183954882477, 14867.479638212719, 1676.2038031934856, 1706.650136721969, 1764.876458647895, 1796.9191386387645, 1870.728744332078, 105612.94387056108, 111406.0, 112038.0, 112491.43754281258, 112781.0, 10298.948505257425, 10511.894881051092, 10742.3017503862, 10742.462876856125, 10866.565337386415, 11101.889811018995, 12682.80975785364, 12894.0, 12915.870841291655, 12924.547640832525, 8531.914680853237, 8744.519051452104, 8755.562221889008, 8802.251808596213, 8802.295816334678, 7411.925880741232, 9041.05068967762, 9062.728118156467, 9074.909250907538, 9191.908080919238, 5068.315777370008, 6125.724342404603, 6233.96883015582, 6245.313015568284, 6372.904406433907, 1792.3816283382212, 1801.4955812372557, 1802.3961972739016, 1809.0864113622536, 1816.554944038719, 942.5098948546854, 950.2825366847985, 983.4148681534475, 1029.2280789407944, 1031.4739482863793, 20907.832219377688, 20964.79035209659, 21282.574348512942, 21302.36092917184, 22505.324840254492, 942.5240253671852, 1023.2019025160387, 1029.6087486754984, 1073.3897908483084, 1073.640330489295, 11101.666949991513, 11401.48693308803, 11527.285436117663, 11534.94232528832, 11662.241954272946, 521223.0, 605156.0, 627819.0, 642960.0, 658063.0, 93696.0, 122907.0, 125281.0, 132070.0, 133728.99406508714, 1066.0618655583191, 1079.2714917430546, 1081.5944020992129, 1082.24783775277, 1107.7371796152393, 15022.849771502146, 18364.72452913234, 18366.173522191802, 18778.624427511648, 19124.426267212006, 50788.74605626948, 51691.22463163131, 51862.481375185766, 52577.0, 52783.0, 72964.90552641609, 73417.0, 73828.0, 73843.63078184574, 74224.0, 7820.452568320163, 8002.239787220205, 8039.437239393186, 8080.383923215498, 8489.53307568065, 13232.073754837069, 13271.469141234242, 13494.98787590915, 13717.862821372059, 13789.034767566174, 10138.732658417697, 10548.894511054792, 11482.024027957717, 11716.70708232301, 11780.646580602595, 11398.94300528492, 11451.0, 11467.054060395454, 11591.88408115908, 11632.651020469399, 11688.415579221175, 11695.88304116948, 11795.823062654239, 11843.940780296043, 11972.221805582609, 7989.320907722677, 8197.0, 8228.670853165806, 8255.060060885808, 8476.957615211884, 10325.070743633109, 11575.01612362925, 11828.822567661664, 11886.227395219283, 11952.820707689565], "unit": "score", "name": "jquery.html", "value": 9718.431587451265}, {"lowerIsBetter": false, "replicates": [1432.813734214552, 1511.4407669162408, 1521.3078049487488, 1801.9639607207855, 1991.2333751505666, 7885.723999660013, 7945.523268603881, 8711.477311361323, 8744.387892847502, 8752.081031491698, 8342.541160236184, 8606.311495080394, 8612.61243244054, 8612.8708069379, 8616.138386161396, 2420.842645228059, 2442.413820683041, 2451.178855083549, 2452.6566280720713, 2453.3008092693585, 2414.843035202715, 2442.157455677788, 2462.6182941643983, 2463.5072985402903, 2478.8512689238614, 2438.7076148420515, 2453.472503411775, 2467.950640987179, 2471.406862353031, 2476.021971321327, 2433.9269821905373, 2447.3514518652573, 2453.0678342229926, 2466.654668346415, 2470.542949554338, 2409.0, 2449.130558651671, 2454.49048834967, 2460.6801115855005, 2464.6179842124498, 8448.197421245033, 8669.479831210148, 8686.348523860735, 8725.520096394695, 8779.868301975475, 5347.839564813062, 5547.3343198816, 5551.584345991787, 5553.861153471155, 5559.193916882029, 3505.0536355184213, 3565.714742820568, 3631.6186800385844, 3648.4892115103908, 3651.5618125824803, 1014.5282443663658, 1015.4313584392763, 1035.2701345551368, 1039.7660526381503, 1056.0231785598291, 11133.443327833576, 11476.770464590745, 11515.0, 11522.596709115225, 11572.884271157182, 4856.344393506902, 4888.242322440027, 4933.062718083553, 4950.975245123751, 4972.875678108004, 10018.949905250427, 10022.248331375176, 10022.448765317977, 10024.79950400988, 10043.849342259726, 5464.699441530754, 5506.311711036121, 5511.035568775448, 5519.586031047687, 5554.888902221933, 3989.261986532501, 4482.887927801831, 4562.064776720765, 4916.631252656065, 5027.069992051483, 3913.5108111486065, 3972.2651309507833, 3981.3629819228786, 4007.7996100194873, 4032.3951407288555, 1195.2768575012167, 1241.4103300932165, 1331.2544974814134, 1343.2075075705382, 1344.395022239996, 1002.5187909803335, 1010.0707349238718, 1013.0679774607379, 1014.0265345268625, 1031.5564307347913, 7853.096893857165, 7983.481073730189, 7992.040955085311, 8012.118666946748, 8020.278174964281, 1026.7689769801734, 1150.9597164099216, 1151.4990978924195, 1158.7219067423757, 1191.7139886427194, 5983.491403230774, 6046.3046749624355, 6195.31851496335, 6196.287426945959, 6198.783042593578, 9980.301378903407, 9998.1001709845, 10319.48402579868, 10375.636852710119, 10457.895421045692, 10073.69778906634, 10199.694009179737, 10274.023967723055, 10291.588336466608, 10348.275620706478, 7729.729459468892, 8019.077806052262, 8225.753227403187, 8304.958475207586, 8333.083360830304, 6661.800145995628, 6919.962005699185, 7686.730964416219, 7877.7636670899965, 7951.045874495097, 9120.270378369847, 9157.587908544265, 9404.623815047322, 9463.952680236554, 9474.052594740471, 9438.48088355147, 9687.031296870256, 9692.06158768235, 9717.757056073655, 9725.0, 6773.0, 6948.478864085315, 6958.095447591781, 7415.592142432218, 7554.66004029809, 7613.885791713018, 7995.680172793023, 8195.098539160568, 8196.54918979462, 8220.972378452694, 7185.640717964186, 7279.890801637874, 7297.233790451926, 7448.8882666758955, 7506.624668766431, 6077.6353418795015, 6361.522885783492, 7005.334493223136, 7164.211936687065, 7295.817604559928, 6696.866062678817, 7296.160941491584, 7503.66233519482, 7635.580043097683, 7721.884171737541, 6972.755953541805, 6975.372216500539, 7047.929520704727, 7049.577025378494, 7053.294670532906, 7017.5087743859485, 7042.542234754725, 7067.469939754642, 7073.752418665322, 7097.503174777716], "unit": "score", "name": "mootools.html", "value": 4842.2811605137085}, {"lowerIsBetter": false, "replicates": [320.4568256804715, 324.4743515504882, 327.8770461077096, 330.7635040945724, 334.65530503581317, 6360.522960777937, 6415.582987105835, 6449.16160899083, 6462.418382345588, 6505.219373675154, 6367.617942923428, 6371.490280777538, 6377.808665740024, 6436.034594810781, 6449.613023218599, 4499.1451624191295, 4622.953770462303, 4626.930596041062, 4638.420197475316, 4765.951490672055, 4595.2188128018315, 4630.143423466652, 4640.327152562876, 4669.392978912737, 4695.859124226262, 4637.652176086807, 4651.581357677808, 4658.883527911796, 4661.463931647853, 4669.673122881382, 4686.390769199999, 4693.507181745936, 4699.271612900006, 4701.905961880778, 4709.987352719182, 3881.1655494068627, 3945.704072194597, 4027.0335119571387, 4049.372347286175, 4066.369712694537, 6032.306284777219, 6053.606515576474, 6089.756409743605, 6111.51107911366, 6117.938820611781, 5509.063459211943, 5515.917261241085, 5517.531009864167, 5522.282103326582, 5527.50252477275, 6755.9324406755795, 6766.932330676728, 6768.492363072789, 6769.52613317068, 6782.559133656297, 4506.098780243931, 4511.6165125964335, 4513.300438432048, 4519.751413672247, 4525.932111018337, 5648.3222013358245, 7088.787336379917, 7243.601601911892, 7255.310745479223, 7260.818479538001, 3596.460530920383, 4496.348029535699, 4499.842505512357, 4502.077074199781, 4507.0, 4577.473590537064, 4579.473360563511, 4579.6794224403975, 4592.058627981256, 4601.838935637236, 5426.593005524602, 5431.755570999236, 5434.619576629677, 5436.6194366393975, 5440.211169380417, 6863.553868998599, 6878.105846239957, 6878.793636190922, 6882.311768823078, 6888.448924086161, 1511.833698293187, 1572.2531797396373, 1582.8179759327595, 1584.1524784240607, 1593.3785823528833, 995.6316163019729, 1020.9642662506776, 1028.062102935971, 1029.696239609317, 1034.363866222268, 5282.6302158849285, 6131.417515336036, 6299.779507717208, 6309.337519560472, 6341.778037768656, 7196.172440169447, 7203.351698347174, 7211.206767255598, 7212.062431883822, 7216.5670059796585, 6433.871322573522, 6436.581622194542, 6442.35576442352, 6450.935490645127, 6456.0961465394885, 3729.813509324523, 3775.7356985011334, 3781.773093614392, 3785.3943369060817, 3788.0719223789797, 7134.821629459201, 7403.14863790671, 7437.293457121565, 7501.0, 7533.7569301065805, 6045.72794224261, 7374.631268436557, 7377.668004939791, 7419.4806363554035, 7439.367653749384, 5639.971800140973, 7523.623818809147, 7534.3595794357, 7539.547627142389, 7541.4343924205905, 7180.60506672138, 7199.1001124859395, 7201.819954501179, 7214.386777123793, 7226.421886248982, 5455.454454554513, 6840.726370945106, 7099.728087012107, 7112.715491380287, 7142.857142857009, 7466.954626352206, 7496.8500629986, 7508.774736757906, 7517.736879209201, 7519.774406767806, 4489.595936365743, 4520.841770538015, 4526.841560545365, 4528.841490547815, 4577.885552861205, 7117.644117793986, 7121.750738724119, 7138.428925686037, 7278.381337586153, 7286.052813134471, 6589.934100658932, 6883.070785444102, 6900.758473453405, 6908.93091069103, 6911.30886911325, 6819.386255237053, 6871.381575658015, 6882.0, 6885.311468853075, 6890.0, 6718.7312507499155, 6723.697433615597, 6724.327567243236, 6732.865342693217, 6737.393634572716, 5569.303837020372, 6879.140107486564, 6892.276310987274, 6894.8621027580175, 6914.896276555755, 6394.1687580614225, 6493.383128602775, 6616.272210056986, 6695.163104611924, 6716.899246511404], "unit": "score", "name": "prototype.html", "value": 4995.049430341089}, {"lowerIsBetter": false, "replicates": [698.7554355975409, 728.9380402665773, 734.5666057026355, 739.7521830186887, 786.9252421020004, 14758.557243282705, 14967.326470308848, 14976.625584360396, 14983.400663973442, 15028.173450460221, 13689.17864928105, 15596.738472921419, 16026.5993350166, 16039.518814435556, 16101.597460063504, 728.0389885351339, 739.5156172706886, 905.2350763604743, 906.8775715278452, 915.6062892956027, 907.346710368537, 922.2990527199344, 922.9446233226028, 924.1128516624049, 924.2144177449181, 972.5283237629744, 977.8386566216566, 980.8038392321564, 981.3179840011195, 981.7741919358516, 769.4575324396287, 957.9042095790435, 969.5540051576284, 971.1793534463367, 978.5694294510392, 720.8197950512372, 721.1778572427385, 721.9819504512377, 722.0288711682779, 722.6747963416484, 15509.844901550952, 15540.533783986499, 15556.144412057332, 15567.766483502757, 15571.221438928009, 11984.400779960966, 12088.697782555419, 12159.027277817753, 12193.756124877453, 12210.75578488434, 9866.703998880044, 10024.147947424477, 10155.543000564918, 10748.247622666417, 10834.945825270823, 3231.5314279429585, 3563.55455568054, 3632.128289210597, 3645.143391303042, 3653.8721144759807, 75020.0, 75391.24608753897, 75791.99999999945, 75890.62054689747, 76091.47817043628, 9257.39826911262, 9335.533223338805, 9462.195713364441, 9499.572519236652, 9898.752531186778, 20555.075021624063, 20794.48013799637, 20826.062827172813, 20862.165513379296, 20862.687059694115, 7397.8150546236775, 7433.566780906905, 7464.989141017065, 7478.5138965967035, 7497.10034795828, 4044.5348784889525, 4069.8168582413864, 4085.4484644573195, 4099.8360065597635, 4408.559144085566, 3582.659647333499, 3625.5830579483695, 3631.618680038558, 3636.1818590816856, 3653.1415117447377, 657.9638119903451, 670.0953712488199, 670.2861452553016, 673.7035704290097, 673.8719643267764, 534.188034188032, 546.5845957072653, 556.6354038105047, 568.8919105369966, 596.6658671144173, 7827.647755850887, 7992.84014319722, 8241.629126689313, 8259.21537453941, 8347.332213422911, 535.3976776126857, 548.3529435266424, 570.4267211452546, 585.9794907178228, 601.2124117406212, 3210.967890321114, 3781.962180378216, 3809.771413715186, 3851.383778595411, 3929.7052721046034, 93020.53489732643, 94675.0, 96813.51593241989, 97172.0, 97354.0, 82632.0, 82696.0, 83248.58375708082, 83540.16459835324, 83749.74375384374, 71454.0, 71924.0, 72132.0, 72380.0, 73846.8922966156, 7721.189275126256, 7783.649735761791, 7914.960425197837, 8049.718259860877, 8054.637541310538, 45419.772901135286, 45579.54420455886, 45768.084638307715, 45964.08071838611, 46896.531034689215, 52256.0, 54005.91988160293, 55172.72413637906, 58374.4162558369, 62156.68921655363, 9655.227581793299, 9849.950750246202, 9862.55618497155, 9890.258230632588, 10148.898511014795, 8950.373473856767, 9838.0, 10604.257701960789, 10647.733806654896, 11009.889901100887, 9993.250506211918, 10075.745109478989, 10265.230107742098, 10506.632267870587, 11090.390028548507, 9864.753381165528, 10290.742731431774, 10385.896141038795, 10507.211959103252, 10670.679879603624, 10991.505382257978, 11334.093272538343, 11431.330867381215, 11534.649540120614, 11600.825987610024, 8404.991401031915, 8572.571371431528, 9433.091268285241, 9501.762455938657, 9552.283578731483, 8628.947276422898, 9039.186473217442, 9431.952840235756, 9517.571709272961, 9749.561269742737], "unit": "score", "name": "yui.html", "value": 6770.113161468035}], "name": "dromaeo_css", "value": 7479.333897682182}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 107.0, 111.0, 111.0, 111.0, 111.0, 117.0, 110.0, 110.0, 111.0], "unit": "score", "name": "ai-astar", "value": 111.0}, {"lowerIsBetter": true, "replicates": [157.0, 123.0, 144.0, 157.0, 123.0, 140.0, 135.0, 119.0, 158.0, 107.0], "unit": "score", "name": "audio-beat-detection", "value": 136.3}, {"lowerIsBetter": true, "replicates": [193.0, 186.0, 186.0, 185.0, 186.0, 186.0, 184.0, 185.0, 179.0, 182.0], "unit": "score", "name": "audio-dft", "value": 185.2}, {"lowerIsBetter": true, "replicates": [78.0, 74.0, 85.0, 78.0, 57.0, 57.0, 57.0, 79.0, 79.0, 72.0], "unit": "score", "name": "audio-fft", "value": 71.6}, {"lowerIsBetter": true, "replicates": [96.0, 92.0, 130.0, 89.0, 115.0, 120.0, 117.0, 76.0, 79.0, 116.0], "unit": "score", "name": "audio-oscillator", "value": 103.0}, {"lowerIsBetter": true, "replicates": [88.0, 84.0, 93.0, 130.0, 87.0, 85.0, 89.0, 85.0, 86.0, 85.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 91.2}, {"lowerIsBetter": true, "replicates": [102.0, 121.0, 93.0, 95.0, 94.0, 94.0, 93.0, 94.0, 93.0, 92.0], "unit": "score", "name": "imaging-darkroom", "value": 97.1}, {"lowerIsBetter": true, "replicates": [87.0, 86.0, 88.0, 88.0, 87.0, 87.0, 87.0, 86.0, 100.0, 142.0], "unit": "score", "name": "imaging-desaturate", "value": 93.8}, {"lowerIsBetter": true, "replicates": [54.0, 55.0, 56.0, 55.0, 53.0, 54.0, 56.0, 66.0, 57.0, 54.0], "unit": "score", "name": "json-parse-financial", "value": 56.0}, {"lowerIsBetter": true, "replicates": [63.0, 82.0, 119.0, 113.0, 85.0, 66.0, 67.0, 67.0, 68.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 79.7}, {"lowerIsBetter": true, "replicates": [83.0, 84.0, 98.0, 107.0, 106.0, 98.0, 82.0, 81.0, 83.0, 81.0], "unit": "score", "name": "stanford-crypto-aes", "value": 90.3}, {"lowerIsBetter": true, "replicates": [123.0, 120.0, 121.0, 124.0, 120.0, 128.0, 129.0, 132.0, 105.0, 136.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.8}, {"lowerIsBetter": true, "replicates": [142.0, 127.0, 127.0, 138.0, 137.0, 129.0, 138.0, 140.0, 137.0, 136.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 135.1}, {"lowerIsBetter": true, "replicates": [66.0, 69.0, 71.0, 99.0, 97.0, 97.0, 95.0, 93.0, 74.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 82.7}], "name": "kraken", "value": 1456.8}]} 05:08:14 INFO - Return code: 0 05:08:14 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 05:08:14 ERROR - # TBPL SUCCESS # 05:08:14 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:08:14 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:08:14 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:08:14 INFO - 2016-03-11 05:08:14.221 screenresolution[1680:9938] starting screenresolution argv=screenresolution get 05:08:14 INFO - 2016-03-11 05:08:14.224 screenresolution[1680:9938] Display 0: 1600x1200x32@60 05:08:14 INFO - 2016-03-11 05:08:14.230 screenresolution[1681:9941] starting screenresolution argv=screenresolution list 05:08:14 INFO - Available Modes on Display 0 05:08:14 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:08:14 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:08:14 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:08:14 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:08:14 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:08:14 INFO - Intel Iris: 05:08:14 INFO - Chipset Model: Intel Iris 05:08:14 INFO - Type: GPU 05:08:14 INFO - Bus: Built-In 05:08:14 INFO - VRAM (Dynamic, Max): 1536 MB 05:08:14 INFO - Vendor: Intel (0x8086) 05:08:14 INFO - Device ID: 0x0a2e 05:08:14 INFO - Revision ID: 0x0009 05:08:14 INFO - Displays: 05:08:14 INFO - Display: 05:08:14 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:08:14 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:08:14 INFO - Display Serial Number: 1600x1200 60 05:08:14 INFO - Main Display: Yes 05:08:14 INFO - Mirror: Off 05:08:14 INFO - Online: Yes 05:08:14 INFO - Rotation: Supported 05:08:14 INFO - Return code: 0 05:08:14 INFO - Running post-action listener: _resource_record_post_action 05:08:14 INFO - Running post-run listener: _resource_record_post_run 05:08:15 INFO - Total resource usage - Wall time: 1207s; CPU: 52.0%; Read bytes: 39273984; Write bytes: 704488960; Read time: 424; Write time: 2042 05:08:15 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 397558272; Write bytes: 391913472; Read time: 30075; Write time: 709 05:08:15 INFO - run-tests - Wall time: 1173s; CPU: 52.0%; Read bytes: 37455360; Write bytes: 299443712; Read time: 405; Write time: 1295 05:08:15 INFO - Running post-run listener: _upload_blobber_files 05:08:15 INFO - Blob upload gear active. 05:08:15 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:08:15 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 05:08:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:08:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:08:15 INFO - (blobuploader) - INFO - Open directory for files ... 05:08:15 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:08:15 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:08:15 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:08:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:08:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:08:17 INFO - (blobuploader) - INFO - Done attempting. 05:08:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 05:08:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:08:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:08:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:08:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:08:18 INFO - (blobuploader) - INFO - Done attempting. 05:08:18 INFO - (blobuploader) - INFO - Iteration through files over. 05:08:18 INFO - Return code: 0 05:08:18 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:08:18 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:08:18 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dccc557bb2a3f230b7ddb0006732582423858fe1eaffd692409e4026c54775669a742ed5816aa6b7328f7c37be7cabdf8a4fbd878c3366516a0fb2a32ab684a0", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/937adf94049b20c54b410682742bfd3f1add1cf6f8f7b9f95f2851162aabe3fe8aaadb24e675648290fe8cd35d50227c4ac8638a1f94516aa774494612a12420"} 05:08:18 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:08:18 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:08:18 INFO - Contents: 05:08:18 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dccc557bb2a3f230b7ddb0006732582423858fe1eaffd692409e4026c54775669a742ed5816aa6b7328f7c37be7cabdf8a4fbd878c3366516a0fb2a32ab684a0", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/937adf94049b20c54b410682742bfd3f1add1cf6f8f7b9f95f2851162aabe3fe8aaadb24e675648290fe8cd35d50227c4ac8638a1f94516aa774494612a12420"} 05:08:18 INFO - Running post-run listener: copy_logs_to_upload_dir 05:08:18 INFO - Copying logs to upload dir... 05:08:18 INFO - mkdir: /builds/slave/test/build/upload/logs 05:08:18 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1262.920769 ========= master_lag: 7.83 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 10 secs) (at 2016-03-11 05:08:26.049231) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 1 secs) (at 2016-03-11 05:08:26.057208) ========= 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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dccc557bb2a3f230b7ddb0006732582423858fe1eaffd692409e4026c54775669a742ed5816aa6b7328f7c37be7cabdf8a4fbd878c3366516a0fb2a32ab684a0", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/937adf94049b20c54b410682742bfd3f1add1cf6f8f7b9f95f2851162aabe3fe8aaadb24e675648290fe8cd35d50227c4ac8638a1f94516aa774494612a12420"} build_url:https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011168 build_url: 'https://queue.taskcluster.net/v1/task/TpImhgmhRcK1t_p_XTb0DA/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dccc557bb2a3f230b7ddb0006732582423858fe1eaffd692409e4026c54775669a742ed5816aa6b7328f7c37be7cabdf8a4fbd878c3366516a0fb2a32ab684a0", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/937adf94049b20c54b410682742bfd3f1add1cf6f8f7b9f95f2851162aabe3fe8aaadb24e675648290fe8cd35d50227c4ac8638a1f94516aa774494612a12420"}' ========= master_lag: 1.23 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 1 secs) (at 2016-03-11 05:08:27.294981) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-11 05:08:27.295364) ========= 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.S0a2YIQ2Cz/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.04uOPKZgOa/Listeners TMPDIR=/var/folders/0y/p7m66bps5fxgrhq27drfxb6r00000w/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.005331 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-11 05:08:27.378975) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-11 05:08:27.379289) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-11 05:08:27.493698) ========= ========= Total master_lag: 9.29 =========