builder: mozilla-central_yosemite_test-dromaeojs slave: t-yosemite-r5-0066 starttime: 1446816194.19 results: success (0) buildid: 20151106030423 builduid: 77f214bcee0b48caa630a89b0dac6e1a revision: cc48981c026c50fdf80d47b040ae1fb8fe99ad07 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.188046) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.188509) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.188843) ========= 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.PF0udq33aU/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.nVWg4x3iFx/Listeners TMPDIR=/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/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:0x0:0x0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006957 basedir: '/builds/slave/test' ========= master_lag: 0.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.245713) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.246050) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.270959) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.271363) ========= 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.PF0udq33aU/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.nVWg4x3iFx/Listeners TMPDIR=/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.019463 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.320559) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.320893) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.321322) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.321645) ========= 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.PF0udq33aU/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.nVWg4x3iFx/Listeners TMPDIR=/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/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:0x0:0x0 using PTY: False --2015-11-06 05:23:14-- 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% 1.03G=0s 2015-11-06 05:23:14 (1.03 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.131039 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.472270) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.472587) ========= 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.PF0udq33aU/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.nVWg4x3iFx/Listeners TMPDIR=/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.179748 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:14.669031) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-06 05:23:14.669393) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev cc48981c026c50fdf80d47b040ae1fb8fe99ad07 --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 cc48981c026c50fdf80d47b040ae1fb8fe99ad07 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.PF0udq33aU/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.nVWg4x3iFx/Listeners TMPDIR=/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/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:0x0:0x0 using PTY: False 2015-11-06 05:23:14,769 truncating revision to first 12 chars 2015-11-06 05:23:14,770 Setting DEBUG logging. 2015-11-06 05:23:14,770 attempt 1/10 2015-11-06 05:23:14,770 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/cc48981c026c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-06 05:23:15,491 unpacking tar archive at: mozilla-central-cc48981c026c/testing/mozharness/ program finished with exit code 0 elapsedTime=1.033528 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-06 05:23:15.721805) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:15.722151) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:15.737948) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:15.738319) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-06 05:23:15.738774) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 14 secs) (at 2015-11-06 05:23:15.739067) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --system-bits 64 --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', '--system-bits', '64', '--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.PF0udq33aU/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.nVWg4x3iFx/Listeners TMPDIR=/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/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:0x0:0x0 using PTY: False 05:23:16 INFO - MultiFileLogger online at 20151106 05:23:16 in /builds/slave/test 05:23:16 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 05:23:16 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:23:16 INFO - {'append_to_log': False, 05:23:16 INFO - 'base_work_dir': '/builds/slave/test', 05:23:16 INFO - 'blob_upload_branch': 'Firefox', 05:23:16 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:23:16 INFO - 'branch': 'Firefox', 05:23:16 INFO - 'buildbot_json_path': 'buildprops.json', 05:23:16 INFO - 'config_files': ('talos/mac_config.py',), 05:23:16 INFO - 'default_actions': ('clobber', 05:23:16 INFO - 'read-buildbot-config', 05:23:16 INFO - 'download-and-extract', 05:23:16 INFO - 'populate-webroot', 05:23:16 INFO - 'create-virtualenv', 05:23:16 INFO - 'install', 05:23:16 INFO - 'run-tests'), 05:23:16 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:23:16 INFO - 'download_minidump_stackwalk': True, 05:23:16 INFO - 'download_symbols': 'ondemand', 05:23:16 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:23:16 INFO - 'tooltool.py': '/tools/tooltool.py', 05:23:16 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:23:16 INFO - '/tools/misc-python/virtualenv.py')}, 05:23:16 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:23:16 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:23:16 INFO - 'installer_path': 'installer.exe', 05:23:16 INFO - 'log_level': 'info', 05:23:16 INFO - 'log_name': 'talos', 05:23:16 INFO - 'log_to_console': True, 05:23:16 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 05:23:16 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 05:23:16 INFO - 'opt_config_files': (), 05:23:16 INFO - 'pip_index': False, 05:23:16 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:23:16 INFO - 'cmd': ('bash', 05:23:16 INFO - '-c', 05:23:16 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:23:16 INFO - 'enabled': True, 05:23:16 INFO - 'halt_on_failure': False, 05:23:16 INFO - 'name': 'check_screen_resolution'},), 05:23:16 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:23:16 INFO - 'cmd': ('bash', 05:23:16 INFO - '-c', 05:23:16 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:23:16 INFO - 'enabled': True, 05:23:16 INFO - 'halt_on_failure': False, 05:23:16 INFO - 'name': 'check_screen_resolution'},), 05:23:16 INFO - 'run_cmd_checks_enabled': True, 05:23:16 INFO - 'sps_profile': False, 05:23:16 INFO - 'sps_profile_interval': 0, 05:23:16 INFO - 'suite': 'dromaeojs', 05:23:16 INFO - 'system_bits': '64', 05:23:16 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:23:16 INFO - 'title': 't-yosemite-r5-0066', 05:23:16 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:23:16 INFO - 'use_talos_json': True, 05:23:16 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:23:16 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:23:16 INFO - 'work_dir': 'build'} 05:23:16 INFO - ##### 05:23:16 INFO - ##### Running clobber step. 05:23:16 INFO - ##### 05:23:16 INFO - Running pre-action listener: _resource_record_pre_action 05:23:16 INFO - Running main action method: clobber 05:23:16 INFO - rmtree: /builds/slave/test/build 05:23:16 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:23:19 INFO - Running post-action listener: _resource_record_post_action 05:23:19 INFO - ##### 05:23:19 INFO - ##### Running read-buildbot-config step. 05:23:19 INFO - ##### 05:23:19 INFO - Running pre-action listener: _resource_record_pre_action 05:23:19 INFO - Running main action method: read_buildbot_config 05:23:19 INFO - Using buildbot properties: 05:23:19 INFO - { 05:23:19 INFO - "properties": { 05:23:19 INFO - "buildnumber": 582, 05:23:19 INFO - "product": "firefox", 05:23:19 INFO - "script_repo_revision": "production", 05:23:19 INFO - "builddir": "mozilla-central_yosemite_test-dromaeojs", 05:23:19 INFO - "repository": "", 05:23:19 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 mozilla-central talos dromaeojs", 05:23:19 INFO - "buildid": "20151106030423", 05:23:19 INFO - "slavename": "t-yosemite-r5-0066", 05:23:19 INFO - "stage_platform": "macosx64", 05:23:19 INFO - "basedir": "/builds/slave/test", 05:23:19 INFO - "nightly_build": "True", 05:23:19 INFO - "project": "", 05:23:19 INFO - "platform": "yosemite", 05:23:19 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 05:23:19 INFO - "slavebuilddir": "test", 05:23:19 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 05:23:19 INFO - "branch": "mozilla-central", 05:23:19 INFO - "repo_path": "mozilla-central", 05:23:19 INFO - "pgo_build": "False", 05:23:19 INFO - "builduid": "77f214bcee0b48caa630a89b0dac6e1a", 05:23:19 INFO - "revision": "cc48981c026c50fdf80d47b040ae1fb8fe99ad07" 05:23:19 INFO - }, 05:23:19 INFO - "sourcestamp": { 05:23:19 INFO - "repository": "", 05:23:19 INFO - "hasPatch": false, 05:23:19 INFO - "project": "", 05:23:19 INFO - "branch": "mozilla-central-macosx64-talos", 05:23:19 INFO - "changes": [ 05:23:19 INFO - { 05:23:19 INFO - "category": null, 05:23:19 INFO - "files": [ 05:23:19 INFO - { 05:23:19 INFO - "url": null, 05:23:19 INFO - "name": "https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 05:23:19 INFO - } 05:23:19 INFO - ], 05:23:19 INFO - "repository": "", 05:23:19 INFO - "rev": "cc48981c026c50fdf80d47b040ae1fb8fe99ad07", 05:23:19 INFO - "who": "sendchange", 05:23:19 INFO - "when": 1446815499, 05:23:19 INFO - "number": 6630147, 05:23:19 INFO - "comments": "", 05:23:19 INFO - "project": "", 05:23:19 INFO - "at": "Fri 06 Nov 2015 05:11:39", 05:23:19 INFO - "branch": "mozilla-central-macosx64-talos", 05:23:19 INFO - "revlink": "", 05:23:19 INFO - "properties": [ 05:23:19 INFO - [ 05:23:19 INFO - "buildid", 05:23:19 INFO - "20151106030423", 05:23:19 INFO - "Change" 05:23:19 INFO - ], 05:23:19 INFO - [ 05:23:19 INFO - "builduid", 05:23:19 INFO - "77f214bcee0b48caa630a89b0dac6e1a", 05:23:19 INFO - "Change" 05:23:19 INFO - ], 05:23:19 INFO - [ 05:23:19 INFO - "nightly_build", 05:23:19 INFO - "True", 05:23:19 INFO - "Change" 05:23:19 INFO - ], 05:23:19 INFO - [ 05:23:19 INFO - "pgo_build", 05:23:19 INFO - "False", 05:23:19 INFO - "Change" 05:23:19 INFO - ] 05:23:19 INFO - ], 05:23:19 INFO - "revision": "cc48981c026c50fdf80d47b040ae1fb8fe99ad07" 05:23:19 INFO - } 05:23:19 INFO - ], 05:23:19 INFO - "revision": "cc48981c026c50fdf80d47b040ae1fb8fe99ad07" 05:23:19 INFO - } 05:23:19 INFO - } 05:23:19 INFO - Found installer url https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 05:23:19 INFO - Running post-action listener: _resource_record_post_action 05:23:19 INFO - ##### 05:23:19 INFO - ##### Running download-and-extract step. 05:23:19 INFO - ##### 05:23:19 INFO - Running pre-action listener: _resource_record_pre_action 05:23:19 INFO - Running main action method: download_and_extract 05:23:19 INFO - mkdir: /builds/slave/test/build/tests 05:23: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')]} 05:23:19 INFO - https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:23:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/test_packages.json 05:23:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/test_packages.json 05:23:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 05:23:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 05:23:20 INFO - Downloaded 1149 bytes. 05:23:20 INFO - Reading from file /builds/slave/test/build/test_packages.json 05:23:20 INFO - Using the following test package requirements: 05:23:20 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 05:23:20 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:23:20 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 05:23:20 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:23:20 INFO - u'jsshell-mac.zip'], 05:23:20 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:23:20 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 05:23:20 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 05:23:20 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:23:20 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 05:23:20 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:23:20 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 05:23:20 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:23:20 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 05:23:20 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 05:23:20 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:23:20 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 05:23:20 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 05:23:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:23:20 INFO - https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 05:23:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:23:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:23:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:23:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 05:23:21 INFO - Downloaded 17461317 bytes. 05:23:21 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 05:23:21 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:23:21 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 05:23:26 INFO - Return code: 0 05:23:26 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 05:23:26 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')]} 05:23:26 INFO - https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 05:23:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:23:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:23:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:23:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 05:23:28 INFO - Downloaded 17461317 bytes. 05:23:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 05:23:28 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:23:28 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 05:23:34 INFO - Return code: 0 05:23:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:23:34 INFO - https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 05:23:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 05:23:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 05:23:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 05:23:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 05:23:35 INFO - Downloaded 11131450 bytes. 05:23:35 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 05:23:35 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 05:23:35 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 05:23:35 INFO - Return code: 0 05:23:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:23:35 INFO - https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 05:23:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 05:23:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 05:23:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 05:23:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 05:23:39 INFO - Downloaded 108784014 bytes. 05:23:39 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 05:23:39 INFO - mkdir: /builds/slave/test/properties 05:23:39 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:23:39 INFO - Writing to file /builds/slave/test/properties/build_url 05:23:39 INFO - Contents: 05:23:39 INFO - build_url:https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 05:23:39 INFO - Running post-action listener: _resource_record_post_action 05:23:39 INFO - Running post-action listener: set_extra_try_arguments 05:23:39 INFO - ##### 05:23:39 INFO - ##### Running populate-webroot step. 05:23:39 INFO - ##### 05:23:39 INFO - Running pre-action listener: _resource_record_pre_action 05:23:39 INFO - Running main action method: populate_webroot 05:23:39 INFO - Guessing talos json url... 05:23:39 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')]} 05:23:39 INFO - https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt matches https://queue.taskcluster.net 05:23:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 05:23:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 05:23:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt to /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 05:23:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.txt'}, attempt #1 05:23:39 INFO - Downloaded 99 bytes. 05:23:39 INFO - Reading from file /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 05:23:39 INFO - Contents: 05:23:39 INFO - 20151106030423 05:23:39 INFO - https://hg.mozilla.org/mozilla-central/rev/cc48981c026c50fdf80d47b040ae1fb8fe99ad07 05:23:39 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')]} 05:23:39 INFO - trying https://hg.mozilla.org/mozilla-central/raw-file/cc48981c02/testing/talos/talos.json 05:23:39 INFO - Downloading https://hg.mozilla.org/mozilla-central/raw-file/cc48981c02/testing/talos/talos.json to /builds/slave/test/build/talos.json 05:23:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/mozilla-central/raw-file/cc48981c02/testing/talos/talos.json', 'file_name': '/builds/slave/test/build/talos.json'}, attempt #1 05:23:40 INFO - Downloaded 4264 bytes. 05:23:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:23:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:23:40 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 05:23:40 INFO - '../fennec_ids.txt'], 05:23:40 INFO - 'tests': ['tcheck2']}, 05:23:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:23:40 INFO - '--tppagecycles', 05:23:40 INFO - '7'], 05:23:40 INFO - 'tests': ['tsvgm']}}, 05:23:40 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:23:40 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:23:40 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:23:40 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:23:40 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:23:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:23:40 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:23:40 INFO - 'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:23:40 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:23:40 INFO - 'tests': ['damp', 'tps']}, 05:23:40 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:23:40 INFO - 'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['damp', 'tps']}, 05:23:40 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:23:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:23:40 INFO - 'other': {'tests': ['a11yr', 05:23:40 INFO - 'ts_paint', 05:23:40 INFO - 'tpaint', 05:23:40 INFO - 'sessionrestore', 05:23:40 INFO - 'sessionrestore_no_auto_restore']}, 05:23:40 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['a11yr', 05:23:40 INFO - 'ts_paint', 05:23:40 INFO - 'tpaint', 05:23:40 INFO - 'sessionrestore', 05:23:40 INFO - 'sessionrestore_no_auto_restore']}, 05:23:40 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['a11yr', 05:23:40 INFO - 'ts_paint', 05:23:40 INFO - 'tpaint', 05:23:40 INFO - 'sessionrestore', 05:23:40 INFO - 'sessionrestore_no_auto_restore']}, 05:23:40 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['a11yr', 05:23:40 INFO - 'ts_paint', 05:23:40 INFO - 'tpaint', 05:23:40 INFO - 'sessionrestore', 05:23:40 INFO - 'sessionrestore_no_auto_restore']}, 05:23:40 INFO - 'other_l64': {'tests': ['a11yr', 05:23:40 INFO - 'ts_paint', 05:23:40 INFO - 'tpaint', 05:23:40 INFO - 'sessionrestore', 05:23:40 INFO - 'sessionrestore_no_auto_restore']}, 05:23:40 INFO - 'other_nol64': {'tests': ['a11yr', 05:23:40 INFO - 'ts_paint', 05:23:40 INFO - 'tpaint', 05:23:40 INFO - 'sessionrestore', 05:23:40 INFO - 'sessionrestore_no_auto_restore']}, 05:23:40 INFO - 'svgr': {'tests': ['tsvgx', 05:23:40 INFO - 'tsvgr_opacity', 05:23:40 INFO - 'tart', 05:23:40 INFO - 'tscrollx', 05:23:40 INFO - 'cart']}, 05:23:40 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['tsvgx', 05:23:40 INFO - 'tsvgr_opacity', 05:23:40 INFO - 'tart', 05:23:40 INFO - 'tscrollx', 05:23:40 INFO - 'cart']}, 05:23:40 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:23:40 INFO - 'tests': ['tp5o']}, 05:23:40 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:23:40 INFO - 'talos_options': ['--e10s'], 05:23:40 INFO - 'tests': ['tp5o']}, 05:23:40 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:23:40 INFO - 'talos_options': ['--xperf_path', 05:23:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:23:40 INFO - 'tests': ['tp5n']}, 05:23:40 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:23:40 INFO - 'talos_options': ['--e10s', 05:23:40 INFO - '--xperf_path', 05:23:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 05:23:40 INFO - 'C:/slave/talos-data/talos/xperf.config'], 05:23:40 INFO - 'tests': ['tp5n']}}, 05:23:40 INFO - 'talos.zip': {'path': '', 05:23:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:23:40 INFO - Running post-action listener: _resource_record_post_action 05:23:40 INFO - ##### 05:23:40 INFO - ##### Running create-virtualenv step. 05:23:40 INFO - ##### 05:23:40 INFO - Running pre-action listener: _resource_record_pre_action 05:23:40 INFO - Running main action method: create_virtualenv 05:23:40 INFO - Creating virtualenv /builds/slave/test/build/venv 05:23:40 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 05:23:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:23:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:23:40 INFO - Using real prefix '/tools/python27' 05:23:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:23:42 INFO - Installing distribute.............................................................................................................................................................................................done. 05:23:46 INFO - Installing pip.................done. 05:23:46 INFO - Return code: 0 05:23:46 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:23:46 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')]} 05:23:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:23:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:46 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')]} 05:23:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:23:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x101366a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1013d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f90f252b450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10131b9f0>, '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 0x10107acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1012e5990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/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.nVWg4x3iFx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:23:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:23:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:23:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/Render', 05:23:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:23:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:23:46 INFO - 'HOME': '/Users/cltbld', 05:23:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:23:46 INFO - 'LOGNAME': 'cltbld', 05:23:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:23:46 INFO - 'MOZ_NO_REMOTE': '1', 05:23:46 INFO - 'NO_EM_RESTART': '1', 05:23:46 INFO - 'PAGER': '/bin/cat', 05:23:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:23:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:23:46 INFO - 'PWD': '/builds/slave/test', 05:23:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:23:46 INFO - 'SHELL': '/bin/bash', 05:23:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.nVWg4x3iFx/Listeners', 05:23:46 INFO - 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', 05:23:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:23:46 INFO - 'USER': 'cltbld', 05:23:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:23:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:23:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:23:46 INFO - 'XPC_FLAGS': '0x0', 05:23:46 INFO - 'XPC_SERVICE_NAME': '0', 05:23:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:23:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:23:46 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 05:23:46 INFO - Cleaning up... 05:23:46 INFO - Return code: 0 05:23:46 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:23:46 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')]} 05:23:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:23:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:46 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')]} 05:23:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:23:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x101366a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1013d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f90f252b450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10131b9f0>, '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 0x10107acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1012e5990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/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.nVWg4x3iFx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:23:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:23:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:23:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/Render', 05:23:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:23:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:23:47 INFO - 'HOME': '/Users/cltbld', 05:23:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:23:47 INFO - 'LOGNAME': 'cltbld', 05:23:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:23:47 INFO - 'MOZ_NO_REMOTE': '1', 05:23:47 INFO - 'NO_EM_RESTART': '1', 05:23:47 INFO - 'PAGER': '/bin/cat', 05:23:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:23:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:23:47 INFO - 'PWD': '/builds/slave/test', 05:23:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:23:47 INFO - 'SHELL': '/bin/bash', 05:23:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.nVWg4x3iFx/Listeners', 05:23:47 INFO - 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', 05:23:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:23:47 INFO - 'USER': 'cltbld', 05:23:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:23:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:23:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:23:47 INFO - 'XPC_FLAGS': '0x0', 05:23:47 INFO - 'XPC_SERVICE_NAME': '0', 05:23:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:23:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:23:47 INFO - Downloading/unpacking psutil>=0.7.1 05:23: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 05:23: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 05:23: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 05:23: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 05:23: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 05:23: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 05:23:50 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 05:23:50 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 05:23:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:23:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:23:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:23:50 INFO - Installing collected packages: psutil 05:23:50 INFO - Running setup.py install for psutil 05:23:50 INFO - building 'psutil._psutil_osx' extension 05:23:50 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 05:23:53 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 05:23:53 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 05:23:53 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 05:23:53 INFO - building 'psutil._psutil_posix' extension 05:23:53 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 05:23:54 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 05:23:54 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 05:23:54 INFO - ^ 05:23:54 INFO - 1 warning generated. 05:23:54 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 05:23:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:23:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:23:54 INFO - Successfully installed psutil 05:23:54 INFO - Cleaning up... 05:23:54 INFO - Return code: 0 05:23:54 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:23:54 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')]} 05:23:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:23:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:54 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')]} 05:23:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:23:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x101366a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1013d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f90f252b450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10131b9f0>, '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 0x10107acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1012e5990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/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.nVWg4x3iFx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:23:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:23:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:23:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/Render', 05:23:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:23:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:23:54 INFO - 'HOME': '/Users/cltbld', 05:23:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:23:54 INFO - 'LOGNAME': 'cltbld', 05:23:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:23:54 INFO - 'MOZ_NO_REMOTE': '1', 05:23:54 INFO - 'NO_EM_RESTART': '1', 05:23:54 INFO - 'PAGER': '/bin/cat', 05:23:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:23:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:23:54 INFO - 'PWD': '/builds/slave/test', 05:23:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:23:54 INFO - 'SHELL': '/bin/bash', 05:23:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.nVWg4x3iFx/Listeners', 05:23:54 INFO - 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', 05:23:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:23:54 INFO - 'USER': 'cltbld', 05:23:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:23:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:23:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:23:54 INFO - 'XPC_FLAGS': '0x0', 05:23:54 INFO - 'XPC_SERVICE_NAME': '0', 05:23:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:23:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:23:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:23:54 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 05:23:54 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 05:23:54 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 05:23:54 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 05:23:54 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 05:23:54 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 05:23:57 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:23:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 05:23:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:23:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:23:57 INFO - Installing collected packages: mozsystemmonitor 05:23:57 INFO - Running setup.py install for mozsystemmonitor 05:23:58 INFO - Successfully installed mozsystemmonitor 05:23:58 INFO - Cleaning up... 05:23:58 INFO - Return code: 0 05:23:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:23: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')]} 05:23:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:23:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23: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')]} 05:23:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:23:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x101366a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1013d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f90f252b450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10131b9f0>, '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 0x10107acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1012e5990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/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.nVWg4x3iFx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:23:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:23:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:23:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/Render', 05:23:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:23:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:23:58 INFO - 'HOME': '/Users/cltbld', 05:23:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:23:58 INFO - 'LOGNAME': 'cltbld', 05:23:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:23:58 INFO - 'MOZ_NO_REMOTE': '1', 05:23:58 INFO - 'NO_EM_RESTART': '1', 05:23:58 INFO - 'PAGER': '/bin/cat', 05:23:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:23:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:23:58 INFO - 'PWD': '/builds/slave/test', 05:23:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:23:58 INFO - 'SHELL': '/bin/bash', 05:23:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.nVWg4x3iFx/Listeners', 05:23:58 INFO - 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', 05:23:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:23:58 INFO - 'USER': 'cltbld', 05:23:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:23:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:23:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:23:58 INFO - 'XPC_FLAGS': '0x0', 05:23:58 INFO - 'XPC_SERVICE_NAME': '0', 05:23:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:23:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:23:58 INFO - Downloading/unpacking blobuploader==1.2.4 05:23:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:24:01 INFO - Downloading blobuploader-1.2.4.tar.gz 05:24:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 05:24:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:24:01 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:24: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 05:24: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 05:24: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 05:24: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 05:24: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 05:24: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 05:24:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 05:24:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:24:02 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:24: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 05:24: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 05:24: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 05:24: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 05:24: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 05:24: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 05:24:02 INFO - Downloading docopt-0.6.1.tar.gz 05:24:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 05:24:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:24:03 INFO - Installing collected packages: blobuploader, requests, docopt 05:24:03 INFO - Running setup.py install for blobuploader 05:24:03 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:24:03 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:24:03 INFO - Running setup.py install for requests 05:24:03 INFO - Running setup.py install for docopt 05:24:04 INFO - Successfully installed blobuploader requests docopt 05:24:04 INFO - Cleaning up... 05:24:04 INFO - Return code: 0 05:24:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:24:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:24:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:24:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x101366a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1013d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f90f252b450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10131b9f0>, '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 0x10107acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1012e5990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/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.nVWg4x3iFx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:24:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:24:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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 05:24:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/Render', 05:24:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:24:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:24:04 INFO - 'HOME': '/Users/cltbld', 05:24:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:24:04 INFO - 'LOGNAME': 'cltbld', 05:24:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:04 INFO - 'MOZ_NO_REMOTE': '1', 05:24:04 INFO - 'NO_EM_RESTART': '1', 05:24:04 INFO - 'PAGER': '/bin/cat', 05:24:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:24:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:04 INFO - 'PWD': '/builds/slave/test', 05:24:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:24:04 INFO - 'SHELL': '/bin/bash', 05:24:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.nVWg4x3iFx/Listeners', 05:24:04 INFO - 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', 05:24:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:24:04 INFO - 'USER': 'cltbld', 05:24:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:24:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:24:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:04 INFO - 'XPC_FLAGS': '0x0', 05:24:04 INFO - 'XPC_SERVICE_NAME': '0', 05:24:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:24:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:24:04 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-Dk7rqP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:24:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:24:04 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-iT4LWT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:24:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:24:04 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-A4q6aJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:24:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:24:05 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-UO2JO9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:24:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:24:05 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-ASfyoB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:24:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:24:05 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-vYNsSo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:24:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:24:05 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-Ail30u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:24:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:24:05 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-TV3Dgd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:24:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:24:05 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-ThmZLJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:24:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:24:05 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-FqNGZ7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:24:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:24:06 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-UtWvJQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:24:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:24:06 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-Pm0ml0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:24:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:24:06 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-_OKmFL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:24:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:24:06 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-dbgdx4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:24:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:24:06 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-8BCaGw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:24:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:24:06 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-XH63Xf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:24:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:24:06 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-T509wR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:24:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:24:07 INFO - Running setup.py install for manifestparser 05:24:07 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:24:07 INFO - Running setup.py install for mozcrash 05:24:07 INFO - Running setup.py install for mozdebug 05:24:07 INFO - Running setup.py install for mozdevice 05:24:07 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:24:07 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:24:07 INFO - Running setup.py install for mozfile 05:24:08 INFO - Running setup.py install for mozhttpd 05:24:08 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:24:08 INFO - Running setup.py install for mozinfo 05:24:08 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:24:08 INFO - Running setup.py install for mozInstall 05:24:08 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:24:08 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:24:08 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:24:08 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:24:08 INFO - Running setup.py install for mozleak 05:24:08 INFO - Running setup.py install for mozlog 05:24:09 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:24:09 INFO - Running setup.py install for moznetwork 05:24:09 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:24:09 INFO - Running setup.py install for mozprocess 05:24:09 INFO - Running setup.py install for mozprofile 05:24:09 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:24:09 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:24:09 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:24:09 INFO - Running setup.py install for mozrunner 05:24:10 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:24:10 INFO - Running setup.py install for mozscreenshot 05:24:10 INFO - Running setup.py install for moztest 05:24:10 INFO - Running setup.py install for mozversion 05:24:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:24:10 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:24:10 INFO - Cleaning up... 05:24:10 INFO - Return code: 0 05:24:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:24:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:24:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x101366a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1013d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f90f252b450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10131b9f0>, '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 0x10107acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1012e5990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/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.nVWg4x3iFx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:24:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:24:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:24:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/Render', 05:24:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:24:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:24:10 INFO - 'HOME': '/Users/cltbld', 05:24:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:24:10 INFO - 'LOGNAME': 'cltbld', 05:24:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:10 INFO - 'MOZ_NO_REMOTE': '1', 05:24:10 INFO - 'NO_EM_RESTART': '1', 05:24:10 INFO - 'PAGER': '/bin/cat', 05:24:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:24:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:10 INFO - 'PWD': '/builds/slave/test', 05:24:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:24:10 INFO - 'SHELL': '/bin/bash', 05:24:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.nVWg4x3iFx/Listeners', 05:24:10 INFO - 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', 05:24:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:24:10 INFO - 'USER': 'cltbld', 05:24:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:24:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:24:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:10 INFO - 'XPC_FLAGS': '0x0', 05:24:10 INFO - 'XPC_SERVICE_NAME': '0', 05:24:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:24:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:24:11 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-sYQsE8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:24:11 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)) 05:24:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:24:11 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-TOnCdC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:24:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 05:24:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:24:11 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-VALZVo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:24:11 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)) 05:24:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:24:11 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-wHvt4P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:24:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 05:24:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:24:11 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-Lk9xBE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:24:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 05:24:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:24:11 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-rHlcFb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:24:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 05:24:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:24:11 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-xtsbBd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:24:12 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)) 05:24:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:24:12 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-8b4b6V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:24:12 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)) 05:24:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:24:12 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-ae80oV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:24:12 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)) 05:24:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:24:12 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-wpQqYk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:24:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 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)) 05:24:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:24:12 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-OSTxVT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:24:12 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)) 05:24:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:24:12 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-4pb5MW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:24:12 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)) 05:24:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:24:12 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-Q2yJ9k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:24:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 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)) 05:24:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:24:13 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-PUPMps-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:24:13 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)) 05:24:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:24:13 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-3seV0c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:24:13 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)) 05:24:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:24:13 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-Mddf5n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:24:13 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)) 05:24:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:24:13 INFO - Running setup.py (path:/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/pip-rOam20-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:24:13 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)) 05:24:13 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:24:13 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:24:13 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)) 05:24:13 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:24:13 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:24:13 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:24:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:24:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:24:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:24:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:24:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:24:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:24:16 INFO - Downloading blessings-1.5.1.tar.gz 05:24:16 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 05:24:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:24:16 INFO - Installing collected packages: blessings 05:24:16 INFO - Running setup.py install for blessings 05:24:16 INFO - Successfully installed blessings 05:24:16 INFO - Cleaning up... 05:24:17 INFO - Return code: 0 05:24:17 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:24:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:24:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:24:17 INFO - Reading from file tmpfile_stdout 05:24:17 INFO - Current package versions: 05:24:17 INFO - blessings == 1.5.1 05:24:17 INFO - blobuploader == 1.2.4 05:24:17 INFO - docopt == 0.6.1 05:24:17 INFO - manifestparser == 1.1 05:24:17 INFO - mozInstall == 1.12 05:24:17 INFO - mozcrash == 0.16 05:24:17 INFO - mozdebug == 0.1 05:24:17 INFO - mozdevice == 0.47 05:24:17 INFO - mozfile == 1.2 05:24:17 INFO - mozhttpd == 0.7 05:24:17 INFO - mozinfo == 0.9 05:24:17 INFO - mozleak == 0.1 05:24:17 INFO - mozlog == 3.0 05:24:17 INFO - moznetwork == 0.27 05:24:17 INFO - mozprocess == 0.22 05:24:17 INFO - mozprofile == 0.27 05:24:17 INFO - mozrunner == 6.11 05:24:17 INFO - mozscreenshot == 0.1 05:24:17 INFO - mozsystemmonitor == 0.0 05:24:17 INFO - moztest == 0.7 05:24:17 INFO - mozversion == 1.4 05:24:17 INFO - psutil == 3.1.1 05:24:17 INFO - requests == 1.2.3 05:24:17 INFO - wsgiref == 0.1.2 05:24:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:24: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')]} 05:24:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:24:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24: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')]} 05:24:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:24:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:24:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x101366a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1013d3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f90f252b450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10131b9f0>, '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 0x10107acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1012e5990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/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.nVWg4x3iFx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 05:24:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 05:24:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 05:24:17 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/Render', 05:24:17 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:24:17 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:24:17 INFO - 'HOME': '/Users/cltbld', 05:24:17 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:24:17 INFO - 'LOGNAME': 'cltbld', 05:24:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:24:17 INFO - 'MOZ_NO_REMOTE': '1', 05:24:17 INFO - 'NO_EM_RESTART': '1', 05:24:17 INFO - 'PAGER': '/bin/cat', 05:24:17 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:24:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:24:17 INFO - 'PWD': '/builds/slave/test', 05:24:17 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:24:17 INFO - 'SHELL': '/bin/bash', 05:24:17 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.nVWg4x3iFx/Listeners', 05:24:17 INFO - 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', 05:24:17 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:24:17 INFO - 'USER': 'cltbld', 05:24:17 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:24:17 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:24:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:24:17 INFO - 'XPC_FLAGS': '0x0', 05:24:17 INFO - 'XPC_SERVICE_NAME': '0', 05:24:17 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:24:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:24:17 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 1)) 05:24:17 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 2)) 05:24:17 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 3)) 05:24:17 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 4)) 05:24:17 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 5)) 05:24:17 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 6)) 05:24:17 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 7)) 05:24:17 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 8)) 05:24:17 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.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:24:17 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 3)) 05:24:17 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.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:24:17 INFO - Cleaning up... 05:24:17 INFO - Return code: 0 05:24:17 INFO - Running post-action listener: _resource_record_post_action 05:24:17 INFO - Running post-action listener: _start_resource_monitoring 05:24:17 INFO - Starting resource monitoring. 05:24:17 INFO - ##### 05:24:17 INFO - ##### Running install step. 05:24:17 INFO - ##### 05:24:17 INFO - Running pre-action listener: _resource_record_pre_action 05:24:17 INFO - Running main action method: install 05:24:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:24:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:24:18 INFO - Reading from file tmpfile_stdout 05:24:18 INFO - Detecting whether we're running mozinstall >=1.0... 05:24:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:24:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:24:18 INFO - Reading from file tmpfile_stdout 05:24:18 INFO - Output received: 05:24:18 INFO - Usage: mozinstall [options] installer 05:24:18 INFO - Options: 05:24:18 INFO - -h, --help show this help message and exit 05:24:18 INFO - -d DEST, --destination=DEST 05:24:18 INFO - Directory to install application into. [default: 05:24:18 INFO - "/builds/slave/test"] 05:24:18 INFO - --app=APP Application being installed. [default: firefox] 05:24:18 INFO - mkdir: /builds/slave/test/build/application 05:24:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 05:24:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 05:25:03 INFO - Reading from file tmpfile_stdout 05:25:03 INFO - Output received: 05:25:03 INFO - /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox 05:25:03 INFO - Running post-action listener: _resource_record_post_action 05:25:03 INFO - ##### 05:25:03 INFO - ##### Running run-tests step. 05:25:03 INFO - ##### 05:25:03 INFO - Running pre-action listener: _resource_record_pre_action 05:25:03 INFO - Running main action method: run_tests 05:25:03 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:25:03 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:25:03 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:25:03 INFO - 2015-11-06 05:25:03.546 screenresolution[1625:7505] starting screenresolution argv=screenresolution get 05:25:03 INFO - 2015-11-06 05:25:03.551 screenresolution[1625:7505] Display 0: 1600x1200x32@60 05:25:03 INFO - 2015-11-06 05:25:03.558 screenresolution[1626:7507] starting screenresolution argv=screenresolution list 05:25:03 INFO - Available Modes on Display 0 05:25:03 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:25:03 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:25:03 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:25:03 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:25:03 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:25:03 INFO - Intel HD Graphics 3000: 05:25:03 INFO - Chipset Model: Intel HD Graphics 3000 05:25:03 INFO - Type: GPU 05:25:03 INFO - Bus: Built-In 05:25:03 INFO - VRAM (Total): 512 MB 05:25:03 INFO - VRAM (Dynamic, Max): 10 05:25:03 INFO - Vendor: Intel (0x8086) 05:25:03 INFO - Device ID: 0x0116 05:25:03 INFO - Revision ID: 0x0009 05:25:03 INFO - Displays: 05:25:03 INFO - Display: 05:25:03 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:25:03 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:25:03 INFO - Display Serial Number: 1600x1200 60 05:25:03 INFO - Main Display: Yes 05:25:03 INFO - Mirror: Off 05:25:03 INFO - Online: Yes 05:25:03 INFO - Rotation: Supported 05:25:03 INFO - Return code: 0 05:25:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:25:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:25:03 INFO - Python 2.7.3 05:25:03 INFO - Return code: 0 05:25:03 INFO - grabbing minidump binary from tooltool 05:25:03 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')]} 05:25:03 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 0x10131b9f0>, '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 0x10107acd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1012e5990>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:25:03 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 05:25:03 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 05:25:03 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:25:03 INFO - Return code: 0 05:25:03 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 05:25:03 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:25:03 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:25:03 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 05:25:03 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:25:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0066', '--webServer', 'localhost'] in /builds/slave/test/build 05:25:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0066 --webServer localhost 05:25:03 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.PF0udq33aU/Render', 05:25:03 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:25:03 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:25:03 INFO - 'HOME': '/Users/cltbld', 05:25:03 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:25:03 INFO - 'LOGNAME': 'cltbld', 05:25:03 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:25:03 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 05:25:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:25:03 INFO - 'MOZ_NO_REMOTE': '1', 05:25:03 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:25:03 INFO - 'NO_EM_RESTART': '1', 05:25:03 INFO - 'PAGER': '/bin/cat', 05:25:03 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:25:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:25:03 INFO - 'PWD': '/builds/slave/test', 05:25:03 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:25:03 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:25:03 INFO - 'SHELL': '/bin/bash', 05:25:03 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.nVWg4x3iFx/Listeners', 05:25:03 INFO - 'TMPDIR': '/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/', 05:25:03 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:25:03 INFO - 'USER': 'cltbld', 05:25:03 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:25:03 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:25:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:25:03 INFO - 'XPC_FLAGS': '0x0', 05:25:03 INFO - 'XPC_SERVICE_NAME': '0', 05:25:03 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:25:03 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0066', '--webServer', 'localhost'] with output_timeout 3600 05:25:04 INFO - mozversion INFO | application_buildid: 20151106030423 05:25:04 INFO - mozversion INFO | application_changeset: cc48981c026c50fdf80d47b040ae1fb8fe99ad07 05:25:04 INFO - mozversion INFO | application_display_name: Nightly 05:25:04 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:25:04 INFO - mozversion INFO | application_name: Firefox 05:25:04 INFO - mozversion INFO | application_remotingname: firefox 05:25:04 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/mozilla-central 05:25:04 INFO - mozversion INFO | application_vendor: Mozilla 05:25:04 INFO - mozversion INFO | application_version: 45.0a1 05:25:04 INFO - mozversion INFO | platform_buildid: 20151106030423 05:25:04 INFO - mozversion INFO | platform_changeset: cc48981c026c50fdf80d47b040ae1fb8fe99ad07 05:25:04 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/mozilla-central 05:25:04 INFO - mozversion INFO | platform_version: 45.0a1 05:25:04 INFO - 2015-11-06 05:25:04,381 DEBUG : using testdate: 1446816304 05:25:04 INFO - 2015-11-06 05:25:04,381 DEBUG : actual date: 1446816304 05:25:06 INFO - 2015-11-06 05:25:06,404 INFO : starting webserver on 'localhost:49271' 05:25:06 INFO - 2015-11-06 05:25:06,406 INFO : Starting test suite t-yosemite-r5-0066 05:25:06 INFO - 2015-11-06 05:25:06,406 INFO : Starting test dromaeo_css 05:25:06 INFO - 2015-11-06 05:25:06,406 DEBUG : operating with platform_type : mac_ 05:25:06 INFO - 2015-11-06 05:25:06,417 INFO : Initialising browser for dromaeo_css test... 05:25:06 INFO - 2015-11-06 05:25:06,446 DEBUG : command line: /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/tmpU8lP5Z/profile http://localhost:49271/getInfo.html 05:25:09 INFO - 2015-11-06 05:25:09,853 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:25:09 INFO - 2015-11-06 05:25:09,853 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:25:09 INFO - 2015-11-06 05:25:09,853 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 05:25:09 INFO - 2015-11-06 05:25:09,853 DEBUG : BROWSER_OUTPUT: __metrics 05:25:09 INFO - 2015-11-06 05:25:09,869 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:25:10 INFO - 2015-11-06 05:25:10,690 INFO : Browser initialized. 05:25:10 INFO - 2015-11-06 05:25:10,690 INFO : Running cycle 1/1 for dromaeo_css test... 05:25:10 INFO - 2015-11-06 05:25:10,691 DEBUG : command line: /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/tmpU8lP5Z/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:25:23 INFO - 2015-11-06 05:25:23,003 DEBUG : BROWSER_OUTPUT: RSS: Main: 222142464 05:25:23 INFO - 2015-11-06 05:25:23,003 DEBUG : BROWSER_OUTPUT: 05:26:13 INFO - 2015-11-06 05:26:13,977 DEBUG : BROWSER_OUTPUT: 1446816373977 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] 05:28:25 INFO - 2015-11-06 05:28:25,127 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49271/tests/dromaeo/cssquery-ext.html) 05:28:26 INFO - 2015-11-06 05:28:26,335 DEBUG : BROWSER_OUTPUT: RSS: Main: 318443520 05:28:26 INFO - 2015-11-06 05:28:26,335 DEBUG : BROWSER_OUTPUT: 05:31:29 INFO - 2015-11-06 05:31:29,256 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-ext.html (next: http://localhost:49271/tests/dromaeo/cssquery-jquery.html) 05:31:29 INFO - 2015-11-06 05:31:29,843 DEBUG : BROWSER_OUTPUT: RSS: Main: 346079232 05:31:29 INFO - 2015-11-06 05:31:29,844 DEBUG : BROWSER_OUTPUT: 05:34:32 INFO - 2015-11-06 05:34:32,298 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49271/tests/dromaeo/cssquery-mootools.html) 05:34:32 INFO - 2015-11-06 05:34:32,890 DEBUG : BROWSER_OUTPUT: RSS: Main: 318590976 05:34:32 INFO - 2015-11-06 05:34:32,890 DEBUG : BROWSER_OUTPUT: 05:37:35 INFO - 2015-11-06 05:37:35,090 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49271/tests/dromaeo/cssquery-prototype.html) 05:37:35 INFO - 2015-11-06 05:37:35,695 DEBUG : BROWSER_OUTPUT: RSS: Main: 308609024 05:37:35 INFO - 2015-11-06 05:37:35,695 DEBUG : BROWSER_OUTPUT: 05:40:38 INFO - 2015-11-06 05:40:38,920 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49271/tests/dromaeo/cssquery-yui.html) 05:40:39 INFO - 2015-11-06 05:40:39,543 DEBUG : BROWSER_OUTPUT: RSS: Main: 312295424 05:40:39 INFO - 2015-11-06 05:40:39,544 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,372 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-yui.html (next: http://localhost:49271/tests/dromaeo/cssquery-dojo.html) 05:43:42 INFO - 2015-11-06 05:43:42,634 DEBUG : BROWSER_OUTPUT: RSS: Main: 358666240 05:43:42 INFO - 2015-11-06 05:43:42,635 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,635 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:43:42 INFO - 2015-11-06 05:43:42,635 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:43:42 INFO - 2015-11-06 05:43:42,635 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:43:42 INFO - 2015-11-06 05:43:42,635 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:43:42 INFO - 2015-11-06 05:43:42,637 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2457.975420245797;2494.575922093244;2501.9124330648433;2529.443522425066;2534.214393538003;4086.2031903778775;4132.566080561543;4159.688023398242;4166.145940082276;4197.832086716531;4104.712670113093;4120.114175452277;4242.406063151154;4247.0019545406885;4257.957420425795;3683.6351310707555;3836.6547010769027;3867.1298957734566;3879.1853710720784;3907.5115610548683;3855.4216867469822;3964.940525892114;3994.3609022556398;3996.6602838758595;4027.335489644205;3600.981995090034;3724.571674257441;3833.712471564616;3845.673117784964;3946.8026598669953;3875.6318149776007;3879.398693202558;3881;3924.862629807943;3941.862034828796;3786.545614526247;3844.903877403059;3881.262560113569;3891.066144125418;3919.2357490289405;3980.223856348013;4065.430839682417;4099.3031184698675;4115.629593336585;4160.271952408317;4466.642668586505;4473.664475164375;4474.597286244254;4503.392042074311;4503.797329120198;4450.26570615848;4516.345129956138;4535.9546404536195;4538.069695712371;4560.384348113029;4061.8578349757618;4091.2840252956207;4200.138971510894;4211.305134652778;4216.987922898544;4535.727856328631;4568.33759104928;4588.95411045892;4599.724016559017;4614.0310534787395;4357.302831546937;4398.208322501981;4418.513963464016;4463.085067561207;4486.147631949919;4341.522432532419;4350.260455722535;4392.3411488277015;4450.2434586120435;4561.019380833137;4303.677224208197;4437.046035102404;4439.200943830077;4467.776611169494;4484.1255955088445;4323.69734118615;4436.334549817553;4440.4005459263235;4445.26653102241;4496.168208881368;3370.359631669975;3469;3470.0804286864;3471.7049050830456;3540.91147721309;3112.9844350778103;3150.1966998415255;3174.746020318369;3198.3123628420003;3212.180893872094;4124.381342798604;4205.789710514462;4209.410682504452;4211.536730959592;4239.936400953989;4353.6081752641785;4450.777461126931;4530.22986092365;4533.297338912474;4624.12141693084;4081.6326530612387;4140.523839758406;4145.751254924714;4197.622214000755;4200.978995105005;3961.8217180226384;4010.0977280111742;4033.6773058155277;4077.673786097105;4082.1223436961195;4384.210842048462;4605.240135377625;4650.6046986005895;4660.743659098782;4704.670673052922;4370.278903980808;4379;4423.867283981485;4426.5130835607415;4554.111948170075;4586.701864378805;4631.93052104212;4636.235021221461;4690.15577196108;4740.265258884879;4283.20760659279;4452.866414007585;4464.598186163261;4469.664775141812;4500.932486012647;4414.4702635683925;4414.867553973386;4451.977740111279;4463.129689710475;4476.574725401082;4394.055278115221;4451.5325890781005;4452.732836029849;4470.8435204767675;4503.166914120898;4272.700910936204;4315.050688848449;4405.647548196072;4416.889577760582;4440.045390241114;4156.501219853637;4187.602177793105;4273.508546517066;4277.850275240352;4302.075053863435;4416.359627854007;4437.733735975852;4438.556144385536;4439.356293337512;4551.499335073206;4224.429701990315;4319.092990472036;4335.609795118455;4337.7397356158735;4427.158839820424 05:43:42 INFO - 2015-11-06 05:43:42,638 DEBUG : BROWSER_OUTPUT: |1;ext.html;422.55420531339445;423.6250917937625;423.73304817964697;428.35746380429356;464.9793702822302;24522.264332070023;29672.85163574182;30263.394732105346;30860.38279234414;30908.227294317596;34084.82957585215;34908.47637285443;35329.470057949155;35388.2922341553;35426.46860297098;6541.21505419348;6747.12287402637;7148.571085734847;7474.215207403226;7498.625068746568;6500.41496265336;8791.516466594334;8878.156575125386;8922.821543569125;8967.01362850086;8413.15868413157;8653.091425400336;8676.089010653885;8697.7825554361;8853.690120845771;6612.768553100618;6778.186617605869;6803.149606299213;8591.957040214822;8686.957565092167;8712.390132690714;8966.775830604221;8975.237104846095;8993.415427997159;9124.22444092253;32121.6787832121;32631.836840815882;32655.346893062007;33131.50302745461;33208;2067.8138967492996;2086.843486738501;2156.406988078291;2166.19850655257;2258.2322010516505;21664.24175153878;21838.89080554603;22073.448163795874;22116;22239.44401389962;1918.175184670591;1949.6198241342943;1970.1134489479791;1992.4122383896786;2036.4806974221626;239895;240985;241981;244684;245697;38399.232015359536;39867;45870;46002.30996535055;46486;38141.23717525634;58766;60413.09380359298;60738.696306519065;61411;11871.109666775026;12052.337121458404;12085.274883507018;12102.939485302517;12275.324857132944;8913.55432228386;8986.595603197871;8986.955065224633;9105;9120.087991200828;16656.33374665024;16749.748753768705;16752.49742507727;16761.329546818233;17010.48968530946;6967.79096627102;7126.964365178141;7178.676959536729;7198.71205151788;7362.190159082496;713.8500914807845;760.3992845651984;766.6320166320086;793.9876657261922;846.5072890926485;22187.889060554917;22623.434414139778;22704.772952270596;22733.545329093657;22823.543529129325;798.3772657327294;828.9046759622721;840.7472865430586;851.8168593752249;893.4594570285014;11635.836416358467;11730.589429369931;11970.700732481584;12026;12040.879591204151;259160;262114;262399;264379;264813;44915.32627010597;45301.093978120254;45351.31973020407;45708.542914570426;45730.31404528935;1066.1577353890495;1069.887661795516;1086.0605576176551;1089.145021158387;1107.396468924438;21936.670949936084;22268.54420666947;22359.21742738996;22361.552768944854;22412.66381004319;33391;34458.31083378368;37405.812970934974;37588.49646014129;38025.80987095047;326745;326859;339276;339864;341495;23926.760732393148;23976.760232398152;23989.400264993514;24133.75866241315;24269.63595546033;25454;26055.869720651277;27229.86385068062;30898.53652195264;33863.32273354568;24550.38624034342;26533.734662653125;26601.201963941112;26660.733392665825;28305.268360382845;25297;25512.872435637702;25526.489470210865;26076;26202.213933582025;26281.910540708046;26308.473830523664;26423.735762642897;26918.865405672845;27975.720242798125;24036.87981560081;24899.012118545892;24932.875335623205;25188.622170667088;25396.238112856645;18412.815871841645;18537.50942198598;18578.907105464386;18684.159212835184;18807.81192188115 05:43:42 INFO - 2015-11-06 05:43:42,642 DEBUG : BROWSER_OUTPUT: |2;jquery.html;261.0614839651455;264.1073172676354;265.6559755117123;267.0519655223955;271.19996011765295;10835.83746243807;11125.72185695358;13630.114042587225;13962.511312104078;14082;12049.036077113831;14275.785863212033;14479.2760361982;14488.420463181461;14618.561443156723;4114.1977314423775;4340.522542520336;4365.388845561624;4386.561343865604;4402.185595664796;3037.407705497429;4259.6805239607;4308.6983911126235;4310.52584215736;4785.928211076836;4638.304254361856;4659.5573420525;4676.321933319667;4727;4730.361401210827;4514.683972121953;4595.333676616905;4646.605038571725;4651.860444186663;4701.237036111441;3937;3973.860914867995;3993.560708322082;3996.200759848042;4012.378081397388;16399.83600163995;16400.425985090584;16515.091669958147;16697.081660508666;16736.581585460463;1631.9963222618123;1670.6324608586092;1810.7555480010294;1847.6489467001227;1847.805980372055;10345.896541034568;10378.688639340831;10411.791764164675;10428.634997775041;10917.181211409097;1276.3618190904547;1306.7255876265995;1316.9468698906214;1338.290705925861;1370.2532119994628;44491.555084449064;45700.54299456996;46265.768671156766;46787.06425871498;46866.297005544606;7284.599347035858;7414.740484083139;7599.696012159562;7661.387089032864;7677.462577619624;9212.907870921204;9229.584668689926;9235.353525253167;9326.813463730823;9375.765605859908;5978.521718262528;5995.190649262294;6006;6029.879402411927;6112.419320164578;5953.196318497034;5976.8804623908145;6010.3088144863905;6034.09488576717;6070.939290607126;4454.22051141049;4527.411436513232;4559.4072770539615;4572.817087316536;4610.976945115253;1201.3061583167691;1264.5826877130526;1288.7744644687143;1317.308413083139;1330.088889110962;658.4600627485416;770.2143813310392;834.6536187482249;848.5926755157559;871.2942516561606;13503.729925401436;14122.152670839783;14627.634309142357;14692.412303507954;14715.337809798584;621.6798348850346;730.3208016544559;778.3461892010738;787.3150359187543;806.9751415702026;8024.117347091816;8313.875291870627;8511.446755960842;8513.19124683154;8595.18345757152;473914;478834;485747;487866;489480;53471;53697.73151134297;54546.454535454934;55438;56242.71878640581;909.013720113684;909.9727008189765;910.5993362920294;912.2473958983865;912.5665308978315;12967.870321297043;13077.346132693518;13318.134321269086;13414.597562073153;13441.663958401119;27767.583486248128;28073.71926280711;28109;28390.148295551167;28515.99999999917;37369.4394584076;37741.24517509579;37798.62201378061;37907.431388529745;38006.42990355202;6950.200726916267;7186.353228209487;7195.784126476214;7302.890456643261;7307.926920730724;14022.29888505591;14348.921311884274;14388.136711797326;14747.705045898807;14834.480793172188;11539.942300288445;11743.17797754149;11896.464659090534;11902.642920712393;12005;7242.311980361857;7432.516886402366;7654.425918056279;7704.961475192588;11011.119110470983;6640.634765087773;6697.430718388797;7549;7892.881606775788;8056.637451314822;4611.308303754464;4701.22429799093;4783.6412269079265;4809.44691360498;4859.659823812299;7580.8483830324185;7835.37317014626;7887.014123234596;7915.44591878563;7925.603719813871 05:43:42 INFO - 2015-11-06 05:43:42,643 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1186.590626233949;1267.7337759070595;1350.8446528649201;1366.4943970730824;1392.6309527975088;5450.781968721247;5687.232223649806;5871.324797648272;6081.3918608139165;6092.969535152318;5923.496502797268;5931.317898441681;5958.986972214723;5979.58142929994;6038.607490513114;1686.224336805068;1705.8635309175297;1706.5562953632084;1708.5216139480904;1709.5127888551765;1664.6171380582473;1667.583104223944;1705.7441383792407;1706.2151410351253;1724.7154219553759;1711.247051297425;1723.6121872578694;1724.7585338052684;1724.7844019497563;1750.4836073358326;1645.2267434305857;1660.5599516128236;1682.9915850420791;1700.625862310296;1719.2435328455501;1691.5432833134985;1702.6509565539159;1704.8636109111242;1719.7420386941933;1732.3330517750758;5305.204219367126;5882.411758824126;5909.7636094556165;5956.434138756855;5966.164736936832;3392.2537041850755;3407.454807230831;3635.5273814404222;3660.432632941872;3726.6646001859963;2251.1108112295715;2297.781710737477;2329;2332.428555004035;2347.917822876208;679.1815861886415;683.3542302524116;697.5915774475106;712.7861641507527;733.8458923626044;7717.922820771832;7801.0638723352995;7856.292933636;7857.1357150713375;7875.409344299201;3199.2001999500126;3265.151060724181;3306.818125003148;3355.4295769719206;3357.261402491448;6829.829254268683;6906.309369063053;6947.270536593686;6966;6984;3731.402975523903;3743.73793834429;3774.2640185163627;3792.81035948207;3795.791231482295;3433.124553238958;3462.6364231755806;3467.8959631211105;3472.472112270593;3477.2176260341726;2620.240130362212;2652.8408295501945;2679.0757188769844;2716.7826573874045;2724.82288651237;841.9494830310078;845.9154084591614;854.4147259127518;855.1875718067736;858.2275951643446;804.8913396691372;824.3034635732796;830.9986466308085;833.8915940927641;944.4003058058182;5676.971615141898;5679.4320567943705;5748.109043098327;5787.39232380594;5795.362510123883;333.4314992937085;343.49506225847966;343.9071450708295;345.2456382803582;348.0862735319786;4204.831806727758;4253.574642535784;4281.957180428218;4305.095929854766;4312.956870431318;5874.823755287348;5997.760089596454;6060.272767267956;6904.896426553606;7133.96433017842;6966.268541803139;7016.894746578805;7028.753993610199;7104.360607545243;7113.53762005468;5494.560435165177;5527.613067085265;5600.215969764236;5686.943130568641;5701.914471282851;5603.159526071122;5603.2155498231095;5611.326640802967;5706.543476521785;5716.114002329646;6317.810465686037;6351.237851457855;6416.32628573993;6462.095306657166;6514.120593719977;6500.674966251763;6524.641144737085;6547.639879806657;6569.080328754074;6677.198736151693;5214.817481388133;5238.397584277857;5271.604629652868;5304.549113325256;5333.599980001438;5717.42825717425;5810.477057064884;5815.9709201453725;5854.209681692917;5862.501687356623;5264.710440925785;5385.2460655507475;5509.035918714289;5518.779248830002;5528.115501519737;5145.45972672864;5248.685078895279;5400.540954018796;5415.241866138823;5488.69812160335;5151.072806894645;5195.454477279831;5210.400803907599;5240.895182096413;5301.3373328333955;4866.95133048665;4867.269909513459;4871.951280487291;4950.77721502526;4953.603711703127;4958.082754690394;4969.527894849984;5002.249662550501;5013.598912086952;5066 05:43:42 INFO - 2015-11-06 05:43:42,647 DEBUG : BROWSER_OUTPUT: |4;prototype.html;233.57023077537332;238.83520370944052;241.771525908017;247.15349926501727;247.86615227777003;4699.506551812062;4713.457952335478;4716.339712440261;4755.191617425037;4825.8793530161765;4574.634029277659;4663.510331415204;4681.812727490905;4688.6249100072;4698.342232087511;3584.91037724057;3593.982030089846;3610.4584312353095;3613.0967258185456;3626.1116026573527;3514.0512061743316;3537.451694987268;3576.3920133577353;3622.366085934964;3689.778613283198;3516.5428494295834;3555;3576.2489877125836;3590.407582748843;3601.117726157082;3565.7860528368383;3585.0678823505814;3585.928281434383;3589.7666651667687;3606.4229723244284;3099.1322429719717;3127.390158919012;3133.0444214514564;3138.5762922005465;3140.0736782649174;4558.680892337537;4582.6104781093645;4583.449986001668;4592.402987611623;4606.723596584216;3993.880183594468;4086.8160932758096;4086.9591304086875;4109.732867363612;4117.444145040441;4955.876103097416;4973.676711013773;4975.90048199034;4989.077020751136;4993.400791904958;3386.4243078676436;3415.1803567143957;3416.9145771355666;3422.8801991930413;3425.657434256579;4922.507749225085;4973.403191617029;4991.700497970097;5029.823956161554;5088.236764485357;3394.287199688044;3411.539442175324;3416.180116771957;3434.5363375944426;3459.996600985736;3453.447448408293;3522.5772907251294;3533.4876442915634;3550.2721942001826;3555.1823080691584;4011.8796436106963;4027.617376349242;4048.2510735514024;4062.431259623655;4066.6543343815515;4712.69367491112;4901.926471102936;4922.163232250526;4932.457429682732;4962.15643340633;1258.5406326690693;1264.72808346206;1272.3765354975994;1283.1915892987358;1288.1755676367131;819.7827575692446;825.6078362777632;835.1648351648352;838.0153319849153;846.7967687754895;4647.767611619405;4690.202665546797;4692.296155576622;4729.858104256878;4750.239961606127;5070.543651071422;5146.099432599281;5150.304708864255;5167.224916262516;5171.3535808024;4657.0918670858855;4682.157211701926;4744.5492678195515;4748.287756836502;4784.282357646381;2790.734880186379;2801.593768903538;2822.8729707163225;2826.462972035307;2856.828590284548;5124.538791508782;5176.559992400613;5274.868128296746;5300.549453296436;5316.229146773773;5202.947970520322;5236.162214045735;5257.106291930381;5276.604254680914;5292.814751483679;5225.895482090337;5226.294450249244;5264.9210261846865;5284.735763211824;5299.761510732026;4959.504049595012;5045.344105266292;5059;5117.897642047213;5154;4965.329680493087;5026.798928042837;5053.090443720165;5062.670926389773;5121.206213036985;5071.290019397361;5168.8449346519665;5270.472952704852;5308.787648494172;5340.732963351895;3256.6743325667244;3305.8842940496966;3314.6519615440034;3366.83165841702;3366.983165084159;4954.975225123995;5022.397312322545;5027.195648696191;5092.567131793839;5116.258142569381;4879.804807807648;4895.534924182197;4949;4974.477679843564;4992.5756310714;4753.714777113384;4897.16748152822;4944.085344211188;4952.059108769322;4973.776180071978;4791.041791641616;4824.565789079;4841.733704646278;4848.61211103118;4849.854504364875;4869.513048695102;4870.659053866196;4894.9021019578695;4963.429205641398;4968.652194346361;4797.592204662643;4799.136155492045;4860.684055536379;4871.610271178368;4888 05:43:42 INFO - 2015-11-06 05:43:42,648 DEBUG : BROWSER_OUTPUT: |5;yui.html;497.487587784582;505.6334157735641;545.7653209120077;606.3996643323111;609.0590038390686;10853;10975.945120274408;10985.780284394317;10998.670039898805;11104.167187460953;9982.351147175428;10434.634787782428;10454.790904181911;10564.894351056488;10617.256792024562;548.0983781679136;551.925490058841;558.1488230448579;703.0965209705529;721.8664547058811;706.9116360454943;707.8867381219006;716.2193209401751;720.9675564599605;730.5069078372104;741.8145463634091;742.7883053329803;744.8845428958521;752.7553545097837;754.8829931360648;571.87418767871;579.8434422705888;586.1559354529464;715.667214745146;749.7975546602441;536.2117687000103;536.9382521010094;542.1813062275952;542.8045903474746;543.4619726470805;10468.214883883664;10618.309809862334;10630.681079567625;10651.84022239667;10779.892201077968;8729.170728780819;8783.78040548985;8827.867581986275;8945.105489451067;9044.638214471413;7097.858042839166;7349.55902645843;7398.49413832354;7566.886496702554;7598.924010759877;2512.1207577347964;2550.2221822344177;2597.480503899209;2621.488809682113;2682.248970288322;38411;38501.614983850086;38551.807240963615;38632.61367386347;39061.804690976365;6899.965500172568;6906.343897329745;6974.616396098263;6978.337057979484;7020.7542736004;14609.415623374945;14704.926475367554;14822.258887055605;14872.330745116496;14877.47928822486;5112.284280200774;5165.431802501722;5178.741062946838;5266.657667251617;5279.52484276417;2814.620026296465;2888.1913064342016;2900.753435957925;2909.229054300612;2923.166897434221;2109.725735654386;2112.968305475419;2117.2483768262355;2144.860584062031;2151.451379898116;325.3265739918346;327.5283591628096;333.03088013879494;338.6072156298731;339.36369307548347;389.690196293947;438.1980974816079;438.4234731328293;459.53816414503876;467.1241422333125;5917.977684520366;6023.939760602338;6030.517558595302;6103.969480152571;6257.74969001244;338.3182886483737;345.3231665934746;426.84420186631655;429;473.51228234917403;2714.3214196450886;2719.252205643464;2829.688734239232;2881;2932.941341173207;43489;43749.78125109354;43863.12273754507;44007.339889901676;48082;39011.41482877702;39799.20401591952;40041.79979100144;40350.59649403527;42091.7895410521;36165.45751813725;36323.27353452916;37708.16535770043;38072.42891356632;38255;6163.599366041193;6181.3200547938795;6393.360663933569;6637.767678131242;6649.4680425564875;26578.335541611614;27641.44717105687;27740.167794966183;28642;28665.426691465636;36529;37059.25881482301;37489.437658435694;37863.62136378601;38072.80963595164;5469.699166545719;5855.882882342415;5927.170196172626;6180.258368995749;6186.876262474815;8481.745547633582;8544.2310192083;8647.394682372174;8719.825603488021;8730.301575874042;8167.387445941459;8249.83500330002;8250.257476827115;8286.212809783061;8308.584570771316;8195.83608327842;8255.339572834278;8329;8347.457415267989;8354.164583541597;7906.52560846351;7927.920720792949;8000.439969202333;8005.719799806979;8062.475939063942;6962.686679099554;6984.092068031124;7394.334509894135;7603.581803000667;7839.647215875413;6959.4432445405255;7025.411061285687;7298.197198308076;7433.9256607433235;7456.440766942393 05:43:42 INFO - 2015-11-06 05:43:42,649 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:43:42 INFO - 2015-11-06 05:43:42,649 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:43:42 INFO - 2015-11-06 05:43:42,649 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1044 05:43:42 INFO - 2015-11-06 05:43:42,649 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:43:42 INFO - 2015-11-06 05:43:42,649 DEBUG : BROWSER_OUTPUT: __startTimestamp1446817422633__endTimestamp 05:43:42 INFO - 2015-11-06 05:43:42,650 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,650 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:43:42 INFO - 2015-11-06 05:43:42,650 DEBUG : BROWSER_OUTPUT: Number of tests: 6 05:43:42 INFO - 2015-11-06 05:43:42,650 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,650 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4171.62 Median:4302.08 stddev:445.61 (10.4%) stddev-sans-first:426.22 05:43:42 INFO - 2015-11-06 05:43:42,652 DEBUG : BROWSER_OUTPUT: Values: 2458.0 2494.6 2501.9 2529.4 2534.2 4086.2 4132.6 4159.7 4166.1 4197.8 4104.7 4120.1 4242.4 4247.0 4258.0 3683.6 3836.7 3867.1 3879.2 3907.5 3855.4 3964.9 3994.4 3996.7 4027.3 3601.0 3724.6 3833.7 3845.7 3946.8 3875.6 3879.4 3881.0 3924.9 3941.9 3786.5 3844.9 3881.3 3891.1 3919.2 3980.2 4065.4 4099.3 4115.6 4160.3 4466.6 4473.7 4474.6 4503.4 4503.8 4450.3 4516.3 4536.0 4538.1 4560.4 4061.9 4091.3 4200.1 4211.3 4217.0 4535.7 4568.3 4589.0 4599.7 4614.0 4357.3 4398.2 4418.5 4463.1 4486.1 4341.5 4350.3 4392.3 4450.2 4561.0 4303.7 4437.0 4439.2 4467.8 4484.1 4323.7 4436.3 4440.4 4445.3 4496.2 3370.4 3469.0 3470.1 3471.7 3540.9 3113.0 3150.2 3174.7 3198.3 3212.2 4124.4 4205.8 4209.4 4211.5 4239.9 4353.6 4450.8 4530.2 4533.3 4624.1 4081.6 4140.5 4145.8 4197.6 4201.0 3961.8 4010.1 4033.7 4077.7 4082.1 4384.2 4605.2 4650.6 4660.7 4704.7 4370.3 4379.0 4423.9 4426.5 4554.1 4586.7 4631.9 4636.2 4690.2 4740.3 4283.2 4452.9 4464.6 4469.7 4500.9 4414.5 4414.9 4452.0 4463.1 4476.6 4394.1 4451.5 4452.7 4470.8 4503.2 4272.7 4315.1 4405.6 4416.9 4440.0 4156.5 4187.6 4273.5 4277.9 4302.1 4416.4 4437.7 4438.6 4439.4 4551.5 4224.4 4319.1 4335.6 4337.7 4427.2 05:43:42 INFO - 2015-11-06 05:43:42,652 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,652 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:40689.87 Median:30561.89 stddev:74560.70 (244.0%) stddev-sans-first:74708.57 05:43:42 INFO - 2015-11-06 05:43:42,654 DEBUG : BROWSER_OUTPUT: Values: 422.6 423.6 423.7 428.4 465.0 24522.3 29672.9 30263.4 30860.4 30908.2 34084.8 34908.5 35329.5 35388.3 35426.5 6541.2 6747.1 7148.6 7474.2 7498.6 6500.4 8791.5 8878.2 8922.8 8967.0 8413.2 8653.1 8676.1 8697.8 8853.7 6612.8 6778.2 6803.1 8592.0 8687.0 8712.4 8966.8 8975.2 8993.4 9124.2 32121.7 32631.8 32655.3 33131.5 33208.0 2067.8 2086.8 2156.4 2166.2 2258.2 21664.2 21838.9 22073.4 22116.0 22239.4 1918.2 1949.6 1970.1 1992.4 2036.5 239895.0 240985.0 241981.0 244684.0 245697.0 38399.2 39867.0 45870.0 46002.3 46486.0 38141.2 58766.0 60413.1 60738.7 61411.0 11871.1 12052.3 12085.3 12102.9 12275.3 8913.6 8986.6 8987.0 9105.0 9120.1 16656.3 16749.7 16752.5 16761.3 17010.5 6967.8 7127.0 7178.7 7198.7 7362.2 713.9 760.4 766.6 794.0 846.5 22187.9 22623.4 22704.8 22733.5 22823.5 798.4 828.9 840.7 851.8 893.5 11635.8 11730.6 11970.7 12026.0 12040.9 259160.0 262114.0 262399.0 264379.0 264813.0 44915.3 45301.1 45351.3 45708.5 45730.3 1066.2 1069.9 1086.1 1089.1 1107.4 21936.7 22268.5 22359.2 22361.6 22412.7 33391.0 34458.3 37405.8 37588.5 38025.8 326745.0 326859.0 339276.0 339864.0 341495.0 23926.8 23976.8 23989.4 24133.8 24269.6 25454.0 26055.9 27229.9 30898.5 33863.3 24550.4 26533.7 26601.2 26660.7 28305.3 25297.0 25512.9 25526.5 26076.0 26202.2 26281.9 26308.5 26423.7 26918.9 27975.7 24036.9 24899.0 24932.9 25188.6 25396.2 18412.8 18537.5 18578.9 18684.2 18807.8 05:43:42 INFO - 2015-11-06 05:43:42,654 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,655 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:23982.75 Median:25136.68 stddev:78792.24 (313.5%) stddev-sans-first:78993.13 05:43:42 INFO - 2015-11-06 05:43:42,656 DEBUG : BROWSER_OUTPUT: Values: 261.1 264.1 265.7 267.1 271.2 10835.8 11125.7 13630.1 13962.5 14082.0 12049.0 14275.8 14479.3 14488.4 14618.6 4114.2 4340.5 4365.4 4386.6 4402.2 3037.4 4259.7 4308.7 4310.5 4785.9 4638.3 4659.6 4676.3 4727.0 4730.4 4514.7 4595.3 4646.6 4651.9 4701.2 3937.0 3973.9 3993.6 3996.2 4012.4 16399.8 16400.4 16515.1 16697.1 16736.6 1632.0 1670.6 1810.8 1847.6 1847.8 10345.9 10378.7 10411.8 10428.6 10917.2 1276.4 1306.7 1316.9 1338.3 1370.3 44491.6 45700.5 46265.8 46787.1 46866.3 7284.6 7414.7 7599.7 7661.4 7677.5 9212.9 9229.6 9235.4 9326.8 9375.8 5978.5 5995.2 6006.0 6029.9 6112.4 5953.2 5976.9 6010.3 6034.1 6070.9 4454.2 4527.4 4559.4 4572.8 4611.0 1201.3 1264.6 1288.8 1317.3 1330.1 658.5 770.2 834.7 848.6 871.3 13503.7 14122.2 14627.6 14692.4 14715.3 621.7 730.3 778.3 787.3 807.0 8024.1 8313.9 8511.4 8513.2 8595.2 473914.0 478834.0 485747.0 487866.0 489480.0 53471.0 53697.7 54546.5 55438.0 56242.7 909.0 910.0 910.6 912.2 912.6 12967.9 13077.3 13318.1 13414.6 13441.7 27767.6 28073.7 28109.0 28390.1 28516.0 37369.4 37741.2 37798.6 37907.4 38006.4 6950.2 7186.4 7195.8 7302.9 7307.9 14022.3 14348.9 14388.1 14747.7 14834.5 11539.9 11743.2 11896.5 11902.6 12005.0 7242.3 7432.5 7654.4 7705.0 11011.1 6640.6 6697.4 7549.0 7892.9 8056.6 4611.3 4701.2 4783.6 4809.4 4859.7 7580.8 7835.4 7887.0 7915.4 7925.6 05:43:42 INFO - 2015-11-06 05:43:42,656 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,656 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4129.85 Median:5302.94 stddev:2145.19 (40.5%) stddev-sans-first:2139.80 05:43:42 INFO - 2015-11-06 05:43:42,657 DEBUG : BROWSER_OUTPUT: Values: 1186.6 1267.7 1350.8 1366.5 1392.6 5450.8 5687.2 5871.3 6081.4 6093.0 5923.5 5931.3 5959.0 5979.6 6038.6 1686.2 1705.9 1706.6 1708.5 1709.5 1664.6 1667.6 1705.7 1706.2 1724.7 1711.2 1723.6 1724.8 1724.8 1750.5 1645.2 1660.6 1683.0 1700.6 1719.2 1691.5 1702.7 1704.9 1719.7 1732.3 5305.2 5882.4 5909.8 5956.4 5966.2 3392.3 3407.5 3635.5 3660.4 3726.7 2251.1 2297.8 2329.0 2332.4 2347.9 679.2 683.4 697.6 712.8 733.8 7717.9 7801.1 7856.3 7857.1 7875.4 3199.2 3265.2 3306.8 3355.4 3357.3 6829.8 6906.3 6947.3 6966.0 6984.0 3731.4 3743.7 3774.3 3792.8 3795.8 3433.1 3462.6 3467.9 3472.5 3477.2 2620.2 2652.8 2679.1 2716.8 2724.8 841.9 845.9 854.4 855.2 858.2 804.9 824.3 831.0 833.9 944.4 5677.0 5679.4 5748.1 5787.4 5795.4 333.4 343.5 343.9 345.2 348.1 4204.8 4253.6 4282.0 4305.1 4313.0 5874.8 5997.8 6060.3 6904.9 7134.0 6966.3 7016.9 7028.8 7104.4 7113.5 5494.6 5527.6 5600.2 5686.9 5701.9 5603.2 5603.2 5611.3 5706.5 5716.1 6317.8 6351.2 6416.3 6462.1 6514.1 6500.7 6524.6 6547.6 6569.1 6677.2 5214.8 5238.4 5271.6 5304.5 5333.6 5717.4 5810.5 5816.0 5854.2 5862.5 5264.7 5385.2 5509.0 5518.8 5528.1 5145.5 5248.7 5400.5 5415.2 5488.7 5151.1 5195.5 5210.4 5240.9 5301.3 4867.0 4867.3 4872.0 4950.8 4953.6 4958.1 4969.5 5002.2 5013.6 5066.0 05:43:42 INFO - 2015-11-06 05:43:42,658 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,658 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4123.27 Median:4746.42 stddev:1241.48 (26.2%) stddev-sans-first:1210.15 05:43:42 INFO - 2015-11-06 05:43:42,659 DEBUG : BROWSER_OUTPUT: Values: 233.6 238.8 241.8 247.2 247.9 4699.5 4713.5 4716.3 4755.2 4825.9 4574.6 4663.5 4681.8 4688.6 4698.3 3584.9 3594.0 3610.5 3613.1 3626.1 3514.1 3537.5 3576.4 3622.4 3689.8 3516.5 3555.0 3576.2 3590.4 3601.1 3565.8 3585.1 3585.9 3589.8 3606.4 3099.1 3127.4 3133.0 3138.6 3140.1 4558.7 4582.6 4583.4 4592.4 4606.7 3993.9 4086.8 4087.0 4109.7 4117.4 4955.9 4973.7 4975.9 4989.1 4993.4 3386.4 3415.2 3416.9 3422.9 3425.7 4922.5 4973.4 4991.7 5029.8 5088.2 3394.3 3411.5 3416.2 3434.5 3460.0 3453.4 3522.6 3533.5 3550.3 3555.2 4011.9 4027.6 4048.3 4062.4 4066.7 4712.7 4901.9 4922.2 4932.5 4962.2 1258.5 1264.7 1272.4 1283.2 1288.2 819.8 825.6 835.2 838.0 846.8 4647.8 4690.2 4692.3 4729.9 4750.2 5070.5 5146.1 5150.3 5167.2 5171.4 4657.1 4682.2 4744.5 4748.3 4784.3 2790.7 2801.6 2822.9 2826.5 2856.8 5124.5 5176.6 5274.9 5300.5 5316.2 5202.9 5236.2 5257.1 5276.6 5292.8 5225.9 5226.3 5264.9 5284.7 5299.8 4959.5 5045.3 5059.0 5117.9 5154.0 4965.3 5026.8 5053.1 5062.7 5121.2 5071.3 5168.8 5270.5 5308.8 5340.7 3256.7 3305.9 3314.7 3366.8 3367.0 4955.0 5022.4 5027.2 5092.6 5116.3 4879.8 4895.5 4949.0 4974.5 4992.6 4753.7 4897.2 4944.1 4952.1 4973.8 4791.0 4824.6 4841.7 4848.6 4849.9 4869.5 4870.7 4894.9 4963.4 4968.7 4797.6 4799.1 4860.7 4871.6 4888.0 05:43:42 INFO - 2015-11-06 05:43:42,659 DEBUG : BROWSER_OUTPUT: 05:43:42 INFO - 2015-11-06 05:43:42,659 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:10635.25 Median:2907.87 stddev:12838.26 (441.5%) stddev-sans-first:12851.70 05:43:42 INFO - 2015-11-06 05:43:42,661 DEBUG : BROWSER_OUTPUT: Values: 497.5 505.6 545.8 606.4 609.1 10853.0 10975.9 10985.8 10998.7 11104.2 9982.4 10434.6 10454.8 10564.9 10617.3 548.1 551.9 558.1 703.1 721.9 706.9 707.9 716.2 721.0 730.5 741.8 742.8 744.9 752.8 754.9 571.9 579.8 586.2 715.7 749.8 536.2 536.9 542.2 542.8 543.5 10468.2 10618.3 10630.7 10651.8 10779.9 8729.2 8783.8 8827.9 8945.1 9044.6 7097.9 7349.6 7398.5 7566.9 7598.9 2512.1 2550.2 2597.5 2621.5 2682.2 38411.0 38501.6 38551.8 38632.6 39061.8 6900.0 6906.3 6974.6 6978.3 7020.8 14609.4 14704.9 14822.3 14872.3 14877.5 5112.3 5165.4 5178.7 5266.7 5279.5 2814.6 2888.2 2900.8 2909.2 2923.2 2109.7 2113.0 2117.2 2144.9 2151.5 325.3 327.5 333.0 338.6 339.4 389.7 438.2 438.4 459.5 467.1 5918.0 6023.9 6030.5 6104.0 6257.7 338.3 345.3 426.8 429.0 473.5 2714.3 2719.3 2829.7 2881.0 2932.9 43489.0 43749.8 43863.1 44007.3 48082.0 39011.4 39799.2 40041.8 40350.6 42091.8 36165.5 36323.3 37708.2 38072.4 38255.0 6163.6 6181.3 6393.4 6637.8 6649.5 26578.3 27641.4 27740.2 28642.0 28665.4 36529.0 37059.3 37489.4 37863.6 38072.8 5469.7 5855.9 5927.2 6180.3 6186.9 8481.7 8544.2 8647.4 8719.8 8730.3 8167.4 8249.8 8250.3 8286.2 8308.6 8195.8 8255.3 8329.0 8347.5 8354.2 7906.5 7927.9 8000.4 8005.7 8062.5 6962.7 6984.1 7394.3 7603.6 7839.6 6959.4 7025.4 7298.2 7433.9 7456.4 05:43:42 INFO - 2015-11-06 05:43:42,661 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:43:42 INFO - 2015-11-06 05:43:42,661 DEBUG : BROWSER_OUTPUT: 05:43:43 INFO - 2015-11-06 05:43:43,397 INFO : Browser exited with error code: 0 05:43:43 INFO - 2015-11-06 05:43:43,432 INFO : Completed test dromaeo_css (00:18:37) 05:43:43 INFO - 2015-11-06 05:43:43,432 INFO : Starting test kraken 05:43:43 INFO - 2015-11-06 05:43:43,432 DEBUG : operating with platform_type : mac_ 05:43:43 INFO - 2015-11-06 05:43:43,433 INFO : Initialising browser for kraken test... 05:43:43 INFO - 2015-11-06 05:43:43,449 DEBUG : command line: /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/tmpeIxNB_/profile http://localhost:49271/getInfo.html 05:43:46 INFO - 2015-11-06 05:43:46,279 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:43:46 INFO - 2015-11-06 05:43:46,279 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:43:46 INFO - 2015-11-06 05:43:46,279 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 05:43:46 INFO - 2015-11-06 05:43:46,279 DEBUG : BROWSER_OUTPUT: __metrics 05:43:46 INFO - 2015-11-06 05:43:46,295 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:43:47 INFO - 2015-11-06 05:43:47,123 INFO : Browser initialized. 05:43:47 INFO - 2015-11-06 05:43:47,123 INFO : Running cycle 1/1 for kraken test... 05:43:47 INFO - 2015-11-06 05:43:47,124 DEBUG : command line: /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/tmpeIxNB_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:43:59 INFO - 2015-11-06 05:43:59,282 DEBUG : BROWSER_OUTPUT: RSS: Main: 220585984 05:43:59 INFO - 2015-11-06 05:43:59,282 DEBUG : BROWSER_OUTPUT: 05:44:02 INFO - 2015-11-06 05:44:02,386 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-beat-detection) 05:44:02 INFO - 2015-11-06 05:44:02,983 DEBUG : BROWSER_OUTPUT: RSS: Main: 279072768 05:44:02 INFO - 2015-11-06 05:44:02,984 DEBUG : BROWSER_OUTPUT: 05:44:06 INFO - 2015-11-06 05:44:06,222 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-dft) 05:44:06 INFO - 2015-11-06 05:44:06,825 DEBUG : BROWSER_OUTPUT: RSS: Main: 292757504 05:44:06 INFO - 2015-11-06 05:44:06,825 DEBUG : BROWSER_OUTPUT: 05:44:10 INFO - 2015-11-06 05:44:10,404 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-fft) 05:44:10 INFO - 2015-11-06 05:44:10,988 DEBUG : BROWSER_OUTPUT: RSS: Main: 277368832 05:44:10 INFO - 2015-11-06 05:44:10,988 DEBUG : BROWSER_OUTPUT: 05:44:13 INFO - 2015-11-06 05:44:13,403 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-oscillator) 05:44:13 INFO - 2015-11-06 05:44:13,995 DEBUG : BROWSER_OUTPUT: RSS: Main: 278204416 05:44:13 INFO - 2015-11-06 05:44:13,995 DEBUG : BROWSER_OUTPUT: 05:44:16 INFO - 2015-11-06 05:44:16,587 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:44:17 INFO - 2015-11-06 05:44:17,173 DEBUG : BROWSER_OUTPUT: RSS: Main: 280027136 05:44:17 INFO - 2015-11-06 05:44:17,173 DEBUG : BROWSER_OUTPUT: 05:44:20 INFO - 2015-11-06 05:44:20,907 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-darkroom) 05:44:21 INFO - 2015-11-06 05:44:21,506 DEBUG : BROWSER_OUTPUT: RSS: Main: 276148224 05:44:21 INFO - 2015-11-06 05:44:21,507 DEBUG : BROWSER_OUTPUT: 05:44:25 INFO - 2015-11-06 05:44:25,384 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-desaturate) 05:44:26 INFO - 2015-11-06 05:44:26,055 DEBUG : BROWSER_OUTPUT: RSS: Main: 276791296 05:44:26 INFO - 2015-11-06 05:44:26,056 DEBUG : BROWSER_OUTPUT: 05:44:29 INFO - 2015-11-06 05:44:29,569 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49271/tests/kraken/driver.html?testName=json-parse-financial) 05:44:30 INFO - 2015-11-06 05:44:30,157 DEBUG : BROWSER_OUTPUT: RSS: Main: 278151168 05:44:30 INFO - 2015-11-06 05:44:30,157 DEBUG : BROWSER_OUTPUT: 05:44:31 INFO - 2015-11-06 05:44:31,967 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49271/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:44:32 INFO - 2015-11-06 05:44:32,553 DEBUG : BROWSER_OUTPUT: RSS: Main: 320712704 05:44:32 INFO - 2015-11-06 05:44:32,554 DEBUG : BROWSER_OUTPUT: 05:44:34 INFO - 2015-11-06 05:44:34,685 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:44:35 INFO - 2015-11-06 05:44:35,313 DEBUG : BROWSER_OUTPUT: RSS: Main: 320417792 05:44:35 INFO - 2015-11-06 05:44:35,313 DEBUG : BROWSER_OUTPUT: 05:44:37 INFO - 2015-11-06 05:44:37,900 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:44:38 INFO - 2015-11-06 05:44:38,484 DEBUG : BROWSER_OUTPUT: RSS: Main: 315629568 05:44:38 INFO - 2015-11-06 05:44:38,484 DEBUG : BROWSER_OUTPUT: 05:44:41 INFO - 2015-11-06 05:44:41,638 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:44:42 INFO - 2015-11-06 05:44:42,247 DEBUG : BROWSER_OUTPUT: RSS: Main: 315674624 05:44:42 INFO - 2015-11-06 05:44:42,248 DEBUG : BROWSER_OUTPUT: 05:44:45 INFO - 2015-11-06 05:44:45,442 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:44:46 INFO - 2015-11-06 05:44:46,045 DEBUG : BROWSER_OUTPUT: RSS: Main: 311111680 05:44:46 INFO - 2015-11-06 05:44:46,045 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,149 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49271/tests/kraken/driver.html?testName=ai-astar) 05:44:48 INFO - 2015-11-06 05:44:48,401 DEBUG : BROWSER_OUTPUT: RSS: Main: 375934976 05:44:48 INFO - 2015-11-06 05:44:48,402 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,402 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:44:48 INFO - 2015-11-06 05:44:48,403 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:44:48 INFO - 2015-11-06 05:44:48,403 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:44:48 INFO - 2015-11-06 05:44:48,404 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:44:48 INFO - 2015-11-06 05:44:48,404 DEBUG : BROWSER_OUTPUT: |0;ai-astar;138;140;134;141;141;139;129;142;138;131 05:44:48 INFO - 2015-11-06 05:44:48,404 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;200;165;189;207;168;200;199;169;213;162 05:44:48 INFO - 2015-11-06 05:44:48,404 DEBUG : BROWSER_OUTPUT: |2;audio-dft;206;205;205;207;207;206;206;207;206;208 05:44:48 INFO - 2015-11-06 05:44:48,405 DEBUG : BROWSER_OUTPUT: |3;audio-fft;98;98;111;109;87;88;92;105;115;91 05:44:48 INFO - 2015-11-06 05:44:48,405 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;124;127;171;114;115;116;159;113;112;163 05:44:48 INFO - 2015-11-06 05:44:48,405 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;148;157;156;148;149;157;149;149;156;150 05:44:48 INFO - 2015-11-06 05:44:48,405 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;162;162;162;162;162;162;162;162;162;162 05:44:48 INFO - 2015-11-06 05:44:48,405 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;130;129;130;128;129;136;137;137;135;131 05:44:48 INFO - 2015-11-06 05:44:48,406 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;69;72;74;73;74;75;74;75;74;77 05:44:48 INFO - 2015-11-06 05:44:48,406 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;82;85;87;86;89;87;86;86;86;86 05:44:48 INFO - 2015-11-06 05:44:48,406 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;110;112;109;109;113;111;111;110;129;122 05:44:48 INFO - 2015-11-06 05:44:48,406 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;163;166;173;175;167;175;163;175;164;168 05:44:48 INFO - 2015-11-06 05:44:48,406 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;194;180;198;199;198;194;193;195;191;191 05:44:48 INFO - 2015-11-06 05:44:48,407 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;85;93;89;91;92;90;91;92;90;90 05:44:48 INFO - 2015-11-06 05:44:48,407 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:44:48 INFO - 2015-11-06 05:44:48,407 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:44:48 INFO - 2015-11-06 05:44:48,407 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1034 05:44:48 INFO - 2015-11-06 05:44:48,407 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:44:48 INFO - 2015-11-06 05:44:48,408 DEBUG : BROWSER_OUTPUT: __startTimestamp1446817488401__endTimestamp 05:44:48 INFO - 2015-11-06 05:44:48,408 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,410 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:44:48 INFO - 2015-11-06 05:44:48,410 DEBUG : BROWSER_OUTPUT: Number of tests: 14 05:44:48 INFO - 2015-11-06 05:44:48,410 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,410 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:137.30 Median:139.50 stddev:4.47 (3.2%) stddev-sans-first:4.74 05:44:48 INFO - 2015-11-06 05:44:48,410 DEBUG : BROWSER_OUTPUT: Values: 138.0 140.0 134.0 141.0 141.0 139.0 129.0 142.0 138.0 131.0 05:44:48 INFO - 2015-11-06 05:44:48,410 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,411 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:187.20 Median:199.50 stddev:19.31 (9.7%) stddev-sans-first:19.92 05:44:48 INFO - 2015-11-06 05:44:48,411 DEBUG : BROWSER_OUTPUT: Values: 200.0 165.0 189.0 207.0 168.0 200.0 199.0 169.0 213.0 162.0 05:44:48 INFO - 2015-11-06 05:44:48,411 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,411 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:206.30 Median:206.50 stddev:0.95 (0.5%) stddev-sans-first:1.00 05:44:48 INFO - 2015-11-06 05:44:48,412 DEBUG : BROWSER_OUTPUT: Values: 206.0 205.0 205.0 207.0 207.0 206.0 206.0 207.0 206.0 208.0 05:44:48 INFO - 2015-11-06 05:44:48,412 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,412 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:99.40 Median:89.50 stddev:10.08 (11.3%) stddev-sans-first:10.68 05:44:48 INFO - 2015-11-06 05:44:48,412 DEBUG : BROWSER_OUTPUT: Values: 98.0 98.0 111.0 109.0 87.0 88.0 92.0 105.0 115.0 91.0 05:44:48 INFO - 2015-11-06 05:44:48,412 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,412 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:131.40 Median:125.50 stddev:23.40 (18.6%) stddev-sans-first:24.66 05:44:48 INFO - 2015-11-06 05:44:48,413 DEBUG : BROWSER_OUTPUT: Values: 124.0 127.0 171.0 114.0 115.0 116.0 159.0 113.0 112.0 163.0 05:44:48 INFO - 2015-11-06 05:44:48,413 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,413 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:151.90 Median:153.00 stddev:4.01 (2.6%) stddev-sans-first:4.00 05:44:48 INFO - 2015-11-06 05:44:48,413 DEBUG : BROWSER_OUTPUT: Values: 148.0 157.0 156.0 148.0 149.0 157.0 149.0 149.0 156.0 150.0 05:44:48 INFO - 2015-11-06 05:44:48,413 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,413 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:162.00 Median:162.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 05:44:48 INFO - 2015-11-06 05:44:48,414 DEBUG : BROWSER_OUTPUT: Values: 162.0 162.0 162.0 162.0 162.0 162.0 162.0 162.0 162.0 162.0 05:44:48 INFO - 2015-11-06 05:44:48,414 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,414 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:132.20 Median:133.00 stddev:3.61 (2.7%) stddev-sans-first:3.75 05:44:48 INFO - 2015-11-06 05:44:48,414 DEBUG : BROWSER_OUTPUT: Values: 130.0 129.0 130.0 128.0 129.0 136.0 137.0 137.0 135.0 131.0 05:44:48 INFO - 2015-11-06 05:44:48,414 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:73.70 Median:74.00 stddev:2.11 (2.9%) stddev-sans-first:1.39 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: Values: 69.0 72.0 74.0 73.0 74.0 75.0 74.0 75.0 74.0 77.0 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:86.00 Median:86.00 stddev:1.76 (2.1%) stddev-sans-first:1.13 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: Values: 82.0 85.0 87.0 86.0 89.0 87.0 86.0 86.0 86.0 86.0 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:113.60 Median:111.50 stddev:6.60 (5.9%) stddev-sans-first:6.87 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: Values: 110.0 112.0 109.0 109.0 113.0 111.0 111.0 110.0 129.0 122.0 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,416 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:168.90 Median:170.50 stddev:5.11 (3.0%) stddev-sans-first:4.95 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: Values: 163.0 166.0 173.0 175.0 167.0 175.0 163.0 175.0 164.0 168.0 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:193.30 Median:194.50 stddev:5.46 (2.8%) stddev-sans-first:5.78 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: Values: 194.0 180.0 198.0 199.0 198.0 194.0 193.0 195.0 191.0 191.0 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:90.30 Median:91.00 stddev:2.21 (2.4%) stddev-sans-first:1.27 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: Values: 85.0 93.0 89.0 91.0 92.0 90.0 91.0 92.0 90.0 90.0 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:44:48 INFO - 2015-11-06 05:44:48,417 DEBUG : BROWSER_OUTPUT: 05:44:49 INFO - 2015-11-06 05:44:49,083 INFO : Browser exited with error code: 0 05:44:49 INFO - 2015-11-06 05:44:49,141 INFO : Completed test kraken (00:01:05) 05:44:49 INFO - 2015-11-06 05:44:49,141 INFO : Starting test v8_7 05:44:49 INFO - 2015-11-06 05:44:49,142 DEBUG : operating with platform_type : mac_ 05:44:49 INFO - 2015-11-06 05:44:49,142 INFO : Initialising browser for v8_7 test... 05:44:49 INFO - 2015-11-06 05:44:49,157 DEBUG : command line: /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/tmpn9mxg4/profile http://localhost:49271/getInfo.html 05:44:51 INFO - 2015-11-06 05:44:51,785 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:44:51 INFO - 2015-11-06 05:44:51,785 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:44:51 INFO - 2015-11-06 05:44:51,785 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 05:44:51 INFO - 2015-11-06 05:44:51,785 DEBUG : BROWSER_OUTPUT: __metrics 05:44:51 INFO - 2015-11-06 05:44:51,805 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:44:52 INFO - 2015-11-06 05:44:52,631 INFO : Browser initialized. 05:44:52 INFO - 2015-11-06 05:44:52,632 INFO : Running cycle 1/1 for v8_7 test... 05:44:52 INFO - 2015-11-06 05:44:52,632 DEBUG : command line: /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/T/tmpn9mxg4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:45:04 INFO - 2015-11-06 05:45:04,816 DEBUG : BROWSER_OUTPUT: RSS: Main: 221769728 05:45:04 INFO - 2015-11-06 05:45:04,816 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,422 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49271/tests/v8_7/run.html (next: http://localhost:49271/tests/v8_7/run.html) 05:45:27 INFO - 2015-11-06 05:45:27,687 DEBUG : BROWSER_OUTPUT: RSS: Main: 687083520 05:45:27 INFO - 2015-11-06 05:45:27,687 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,688 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:45:27 INFO - 2015-11-06 05:45:27,688 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:45:27 INFO - 2015-11-06 05:45:27,688 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:45:27 INFO - 2015-11-06 05:45:27,688 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:45:27 INFO - 2015-11-06 05:45:27,688 DEBUG : BROWSER_OUTPUT: |0;Richards;210.9259649862898 05:45:27 INFO - 2015-11-06 05:45:27,688 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;249.19013207077 05:45:27 INFO - 2015-11-06 05:45:27,689 DEBUG : BROWSER_OUTPUT: |2;Encrypt;415.45492314083924 05:45:27 INFO - 2015-11-06 05:45:27,689 DEBUG : BROWSER_OUTPUT: |3;Decrypt;7299.270072992701 05:45:27 INFO - 2015-11-06 05:45:27,689 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2629.9212598425197 05:45:27 INFO - 2015-11-06 05:45:27,689 DEBUG : BROWSER_OUTPUT: |5;Earley;1031.9917440660474 05:45:27 INFO - 2015-11-06 05:45:27,689 DEBUG : BROWSER_OUTPUT: |6;Boyer;16095.238095238095 05:45:27 INFO - 2015-11-06 05:45:27,689 DEBUG : BROWSER_OUTPUT: |7;RegExp;37611.11111111111 05:45:27 INFO - 2015-11-06 05:45:27,689 DEBUG : BROWSER_OUTPUT: |8;Splay;800 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;7360.294117647059 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: __startTimestamp1446817527683__endTimestamp 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: Number of tests: 10 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:210.93 Median:210.93 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: Values: 210.9 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,690 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:249.19 Median:249.19 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: Values: 249.2 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:415.45 Median:415.45 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: Values: 415.5 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:7299.27 Median:7299.27 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: Values: 7299.3 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2629.92 Median:2629.92 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: Values: 2629.9 05:45:27 INFO - 2015-11-06 05:45:27,691 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:1031.99 Median:1031.99 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: Values: 1032.0 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:16095.24 Median:16095.24 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: Values: 16095.2 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:37611.11 Median:37611.11 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: Values: 37611.1 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:800.00 Median:800.00 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: Values: 800.0 05:45:27 INFO - 2015-11-06 05:45:27,692 DEBUG : BROWSER_OUTPUT: 05:45:27 INFO - 2015-11-06 05:45:27,693 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:7360.29 Median:7360.29 stddev:0.00 (0.0%) 05:45:27 INFO - 2015-11-06 05:45:27,693 DEBUG : BROWSER_OUTPUT: Values: 7360.3 05:45:27 INFO - 2015-11-06 05:45:27,693 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:45:27 INFO - 2015-11-06 05:45:27,693 DEBUG : BROWSER_OUTPUT: 05:45:28 INFO - 2015-11-06 05:45:28,507 INFO : Browser exited with error code: 0 05:45:28 INFO - 2015-11-06 05:45:28,532 INFO : Completed test v8_7 (00:00:39) 05:45:28 INFO - 2015-11-06 05:45:28,683 INFO : Completed test suite (00:20:22) 05:45:28 INFO - 2015-11-06 05:45:28,683 DEBUG : Working with test: dromaeo_css 05:45:28 INFO - 2015-11-06 05:45:28,684 DEBUG : Generating results file: dromaeo_css 05:45:28 INFO - 2015-11-06 05:45:28,684 DEBUG : Working with test: kraken 05:45:28 INFO - 2015-11-06 05:45:28,684 DEBUG : Generating results file: kraken 05:45:28 INFO - 2015-11-06 05:45:28,685 INFO : javascript benchmark 05:45:28 INFO - 2015-11-06 05:45:28,685 DEBUG : Working with test: v8_7 05:45:28 INFO - 2015-11-06 05:45:28,685 DEBUG : Generating results file: v8_7 05:45:28 INFO - 2015-11-06 05:45:28,685 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:45:28 INFO - 2015-11-06 05:45:28,820 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,1,55]] 05:45:28 INFO - 2015-11-06 05:45:28,820 DEBUG : process_Request line: dromaeo_css 5376.61 graph.html#tests=[[72,1,55]] 05:45:28 INFO - 2015-11-06 05:45:28,820 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:45:28 INFO - 2015-11-06 05:45:28,851 DEBUG : process_Request line: kraken 1933.50 graph.html#tests=[[232,1,55]] 05:45:28 INFO - 2015-11-06 05:45:28,852 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:45:28 INFO - 2015-11-06 05:45:28,883 DEBUG : process_Request line: v8_7 14496.23 graph.html#tests=[[230,1,55]] 05:45:28 INFO - 2015-11-06 05:45:28,884 INFO : javascript benchmark 05:45:28 INFO - 2015-11-06 05:45:28,886 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [261.0614839651455, 264.1073172676354, 265.6559755117123, 267.0519655223955, 271.19996011765295, 10835.83746243807, 11125.72185695358, 13630.114042587225, 13962.511312104078, 14082.0, 12049.036077113831, 14275.785863212033, 14479.2760361982, 14488.420463181461, 14618.561443156723, 4114.1977314423775, 4340.522542520336, 4365.388845561624, 4386.561343865604, 4402.185595664796, 3037.407705497429, 4259.6805239607, 4308.6983911126235, 4310.52584215736, 4785.928211076836, 4638.304254361856, 4659.5573420525, 4676.321933319667, 4727.0, 4730.361401210827, 4514.683972121953, 4595.333676616905, 4646.605038571725, 4651.860444186663, 4701.237036111441, 3937.0, 3973.860914867995, 3993.560708322082, 3996.200759848042, 4012.378081397388, 16399.83600163995, 16400.425985090584, 16515.091669958147, 16697.081660508666, 16736.581585460463, 1631.9963222618123, 1670.6324608586092, 1810.7555480010294, 1847.6489467001227, 1847.805980372055, 10345.896541034568, 10378.688639340831, 10411.791764164675, 10428.634997775041, 10917.181211409097, 1276.3618190904547, 1306.7255876265995, 1316.9468698906214, 1338.290705925861, 1370.2532119994628, 44491.555084449064, 45700.54299456996, 46265.768671156766, 46787.06425871498, 46866.297005544606, 7284.599347035858, 7414.740484083139, 7599.696012159562, 7661.387089032864, 7677.462577619624, 9212.907870921204, 9229.584668689926, 9235.353525253167, 9326.813463730823, 9375.765605859908, 5978.521718262528, 5995.190649262294, 6006.0, 6029.879402411927, 6112.419320164578, 5953.196318497034, 5976.8804623908145, 6010.3088144863905, 6034.09488576717, 6070.939290607126, 4454.22051141049, 4527.411436513232, 4559.4072770539615, 4572.817087316536, 4610.976945115253, 1201.3061583167691, 1264.5826877130526, 1288.7744644687143, 1317.308413083139, 1330.088889110962, 658.4600627485416, 770.2143813310392, 834.6536187482249, 848.5926755157559, 871.2942516561606, 13503.729925401436, 14122.152670839783, 14627.634309142357, 14692.412303507954, 14715.337809798584, 621.6798348850346, 730.3208016544559, 778.3461892010738, 787.3150359187543, 806.9751415702026, 8024.117347091816, 8313.875291870627, 8511.446755960842, 8513.19124683154, 8595.18345757152, 473914.0, 478834.0, 485747.0, 487866.0, 489480.0, 53471.0, 53697.73151134297, 54546.454535454934, 55438.0, 56242.71878640581, 909.013720113684, 909.9727008189765, 910.5993362920294, 912.2473958983865, 912.5665308978315, 12967.870321297043, 13077.346132693518, 13318.134321269086, 13414.597562073153, 13441.663958401119, 27767.583486248128, 28073.71926280711, 28109.0, 28390.148295551167, 28515.99999999917, 37369.4394584076, 37741.24517509579, 37798.62201378061, 37907.431388529745, 38006.42990355202, 6950.200726916267, 7186.353228209487, 7195.784126476214, 7302.890456643261, 7307.926920730724, 14022.29888505591, 14348.921311884274, 14388.136711797326, 14747.705045898807, 14834.480793172188, 11539.942300288445, 11743.17797754149, 11896.464659090534, 11902.642920712393, 12005.0, 7242.311980361857, 7432.516886402366, 7654.425918056279, 7704.961475192588, 11011.119110470983, 6640.634765087773, 6697.430718388797, 7549.0, 7892.881606775788, 8056.637451314822, 4611.308303754464, 4701.22429799093, 4783.6412269079265, 4809.44691360498, 4859.659823812299, 7580.8483830324185, 7835.37317014626, 7887.014123234596, 7915.44591878563, 7925.603719813871], "dojo.html": [2457.975420245797, 2494.575922093244, 2501.9124330648433, 2529.443522425066, 2534.214393538003, 4086.2031903778775, 4132.566080561543, 4159.688023398242, 4166.145940082276, 4197.832086716531, 4104.712670113093, 4120.114175452277, 4242.406063151154, 4247.0019545406885, 4257.957420425795, 3683.6351310707555, 3836.6547010769027, 3867.1298957734566, 3879.1853710720784, 3907.5115610548683, 3855.4216867469822, 3964.940525892114, 3994.3609022556398, 3996.6602838758595, 4027.335489644205, 3600.981995090034, 3724.571674257441, 3833.712471564616, 3845.673117784964, 3946.8026598669953, 3875.6318149776007, 3879.398693202558, 3881.0, 3924.862629807943, 3941.862034828796, 3786.545614526247, 3844.903877403059, 3881.262560113569, 3891.066144125418, 3919.2357490289405, 3980.223856348013, 4065.430839682417, 4099.3031184698675, 4115.629593336585, 4160.271952408317, 4466.642668586505, 4473.664475164375, 4474.597286244254, 4503.392042074311, 4503.797329120198, 4450.26570615848, 4516.345129956138, 4535.9546404536195, 4538.069695712371, 4560.384348113029, 4061.8578349757618, 4091.2840252956207, 4200.138971510894, 4211.305134652778, 4216.987922898544, 4535.727856328631, 4568.33759104928, 4588.95411045892, 4599.724016559017, 4614.0310534787395, 4357.302831546937, 4398.208322501981, 4418.513963464016, 4463.085067561207, 4486.147631949919, 4341.522432532419, 4350.260455722535, 4392.3411488277015, 4450.2434586120435, 4561.019380833137, 4303.677224208197, 4437.046035102404, 4439.200943830077, 4467.776611169494, 4484.1255955088445, 4323.69734118615, 4436.334549817553, 4440.4005459263235, 4445.26653102241, 4496.168208881368, 3370.359631669975, 3469.0, 3470.0804286864, 3471.7049050830456, 3540.91147721309, 3112.9844350778103, 3150.1966998415255, 3174.746020318369, 3198.3123628420003, 3212.180893872094, 4124.381342798604, 4205.789710514462, 4209.410682504452, 4211.536730959592, 4239.936400953989, 4353.6081752641785, 4450.777461126931, 4530.22986092365, 4533.297338912474, 4624.12141693084, 4081.6326530612387, 4140.523839758406, 4145.751254924714, 4197.622214000755, 4200.978995105005, 3961.8217180226384, 4010.0977280111742, 4033.6773058155277, 4077.673786097105, 4082.1223436961195, 4384.210842048462, 4605.240135377625, 4650.6046986005895, 4660.743659098782, 4704.670673052922, 4370.278903980808, 4379.0, 4423.867283981485, 4426.5130835607415, 4554.111948170075, 4586.701864378805, 4631.93052104212, 4636.235021221461, 4690.15577196108, 4740.265258884879, 4283.20760659279, 4452.866414007585, 4464.598186163261, 4469.664775141812, 4500.932486012647, 4414.4702635683925, 4414.867553973386, 4451.977740111279, 4463.129689710475, 4476.574725401082, 4394.055278115221, 4451.5325890781005, 4452.732836029849, 4470.8435204767675, 4503.166914120898, 4272.700910936204, 4315.050688848449, 4405.647548196072, 4416.889577760582, 4440.045390241114, 4156.501219853637, 4187.602177793105, 4273.508546517066, 4277.850275240352, 4302.075053863435, 4416.359627854007, 4437.733735975852, 4438.556144385536, 4439.356293337512, 4551.499335073206, 4224.429701990315, 4319.092990472036, 4335.609795118455, 4337.7397356158735, 4427.158839820424], "mootools.html": [1186.590626233949, 1267.7337759070595, 1350.8446528649201, 1366.4943970730824, 1392.6309527975088, 5450.781968721247, 5687.232223649806, 5871.324797648272, 6081.3918608139165, 6092.969535152318, 5923.496502797268, 5931.317898441681, 5958.986972214723, 5979.58142929994, 6038.607490513114, 1686.224336805068, 1705.8635309175297, 1706.5562953632084, 1708.5216139480904, 1709.5127888551765, 1664.6171380582473, 1667.583104223944, 1705.7441383792407, 1706.2151410351253, 1724.7154219553759, 1711.247051297425, 1723.6121872578694, 1724.7585338052684, 1724.7844019497563, 1750.4836073358326, 1645.2267434305857, 1660.5599516128236, 1682.9915850420791, 1700.625862310296, 1719.2435328455501, 1691.5432833134985, 1702.6509565539159, 1704.8636109111242, 1719.7420386941933, 1732.3330517750758, 5305.204219367126, 5882.411758824126, 5909.7636094556165, 5956.434138756855, 5966.164736936832, 3392.2537041850755, 3407.454807230831, 3635.5273814404222, 3660.432632941872, 3726.6646001859963, 2251.1108112295715, 2297.781710737477, 2329.0, 2332.428555004035, 2347.917822876208, 679.1815861886415, 683.3542302524116, 697.5915774475106, 712.7861641507527, 733.8458923626044, 7717.922820771832, 7801.0638723352995, 7856.292933636, 7857.1357150713375, 7875.409344299201, 3199.2001999500126, 3265.151060724181, 3306.818125003148, 3355.4295769719206, 3357.261402491448, 6829.829254268683, 6906.309369063053, 6947.270536593686, 6966.0, 6984.0, 3731.402975523903, 3743.73793834429, 3774.2640185163627, 3792.81035948207, 3795.791231482295, 3433.124553238958, 3462.6364231755806, 3467.8959631211105, 3472.472112270593, 3477.2176260341726, 2620.240130362212, 2652.8408295501945, 2679.0757188769844, 2716.7826573874045, 2724.82288651237, 841.9494830310078, 845.9154084591614, 854.4147259127518, 855.1875718067736, 858.2275951643446, 804.8913396691372, 824.3034635732796, 830.9986466308085, 833.8915940927641, 944.4003058058182, 5676.971615141898, 5679.4320567943705, 5748.109043098327, 5787.39232380594, 5795.362510123883, 333.4314992937085, 343.49506225847966, 343.9071450708295, 345.2456382803582, 348.0862735319786, 4204.831806727758, 4253.574642535784, 4281.957180428218, 4305.095929854766, 4312.956870431318, 5874.823755287348, 5997.760089596454, 6060.272767267956, 6904.896426553606, 7133.96433017842, 6966.268541803139, 7016.894746578805, 7028.753993610199, 7104.360607545243, 7113.53762005468, 5494.560435165177, 5527.613067085265, 5600.215969764236, 5686.943130568641, 5701.914471282851, 5603.159526071122, 5603.2155498231095, 5611.326640802967, 5706.543476521785, 5716.114002329646, 6317.810465686037, 6351.237851457855, 6416.32628573993, 6462.095306657166, 6514.120593719977, 6500.674966251763, 6524.641144737085, 6547.639879806657, 6569.080328754074, 6677.198736151693, 5214.817481388133, 5238.397584277857, 5271.604629652868, 5304.549113325256, 5333.599980001438, 5717.42825717425, 5810.477057064884, 5815.9709201453725, 5854.209681692917, 5862.501687356623, 5264.710440925785, 5385.2460655507475, 5509.035918714289, 5518.779248830002, 5528.115501519737, 5145.45972672864, 5248.685078895279, 5400.540954018796, 5415.241866138823, 5488.69812160335, 5151.072806894645, 5195.454477279831, 5210.400803907599, 5240.895182096413, 5301.3373328333955, 4866.95133048665, 4867.269909513459, 4871.951280487291, 4950.77721502526, 4953.603711703127, 4958.082754690394, 4969.527894849984, 5002.249662550501, 5013.598912086952, 5066.0], "ext.html": [422.55420531339445, 423.6250917937625, 423.73304817964697, 428.35746380429356, 464.9793702822302, 24522.264332070023, 29672.85163574182, 30263.394732105346, 30860.38279234414, 30908.227294317596, 34084.82957585215, 34908.47637285443, 35329.470057949155, 35388.2922341553, 35426.46860297098, 6541.21505419348, 6747.12287402637, 7148.571085734847, 7474.215207403226, 7498.625068746568, 6500.41496265336, 8791.516466594334, 8878.156575125386, 8922.821543569125, 8967.01362850086, 8413.15868413157, 8653.091425400336, 8676.089010653885, 8697.7825554361, 8853.690120845771, 6612.768553100618, 6778.186617605869, 6803.149606299213, 8591.957040214822, 8686.957565092167, 8712.390132690714, 8966.775830604221, 8975.237104846095, 8993.415427997159, 9124.22444092253, 32121.6787832121, 32631.836840815882, 32655.346893062007, 33131.50302745461, 33208.0, 2067.8138967492996, 2086.843486738501, 2156.406988078291, 2166.19850655257, 2258.2322010516505, 21664.24175153878, 21838.89080554603, 22073.448163795874, 22116.0, 22239.44401389962, 1918.175184670591, 1949.6198241342943, 1970.1134489479791, 1992.4122383896786, 2036.4806974221626, 239895.0, 240985.0, 241981.0, 244684.0, 245697.0, 38399.232015359536, 39867.0, 45870.0, 46002.30996535055, 46486.0, 38141.23717525634, 58766.0, 60413.09380359298, 60738.696306519065, 61411.0, 11871.109666775026, 12052.337121458404, 12085.274883507018, 12102.939485302517, 12275.324857132944, 8913.55432228386, 8986.595603197871, 8986.955065224633, 9105.0, 9120.087991200828, 16656.33374665024, 16749.748753768705, 16752.49742507727, 16761.329546818233, 17010.48968530946, 6967.79096627102, 7126.964365178141, 7178.676959536729, 7198.71205151788, 7362.190159082496, 713.8500914807845, 760.3992845651984, 766.6320166320086, 793.9876657261922, 846.5072890926485, 22187.889060554917, 22623.434414139778, 22704.772952270596, 22733.545329093657, 22823.543529129325, 798.3772657327294, 828.9046759622721, 840.7472865430586, 851.8168593752249, 893.4594570285014, 11635.836416358467, 11730.589429369931, 11970.700732481584, 12026.0, 12040.879591204151, 259160.0, 262114.0, 262399.0, 264379.0, 264813.0, 44915.32627010597, 45301.093978120254, 45351.31973020407, 45708.542914570426, 45730.31404528935, 1066.1577353890495, 1069.887661795516, 1086.0605576176551, 1089.145021158387, 1107.396468924438, 21936.670949936084, 22268.54420666947, 22359.21742738996, 22361.552768944854, 22412.66381004319, 33391.0, 34458.31083378368, 37405.812970934974, 37588.49646014129, 38025.80987095047, 326745.0, 326859.0, 339276.0, 339864.0, 341495.0, 23926.760732393148, 23976.760232398152, 23989.400264993514, 24133.75866241315, 24269.63595546033, 25454.0, 26055.869720651277, 27229.86385068062, 30898.53652195264, 33863.32273354568, 24550.38624034342, 26533.734662653125, 26601.201963941112, 26660.733392665825, 28305.268360382845, 25297.0, 25512.872435637702, 25526.489470210865, 26076.0, 26202.213933582025, 26281.910540708046, 26308.473830523664, 26423.735762642897, 26918.865405672845, 27975.720242798125, 24036.87981560081, 24899.012118545892, 24932.875335623205, 25188.622170667088, 25396.238112856645, 18412.815871841645, 18537.50942198598, 18578.907105464386, 18684.159212835184, 18807.81192188115], "prototype.html": [233.57023077537332, 238.83520370944052, 241.771525908017, 247.15349926501727, 247.86615227777003, 4699.506551812062, 4713.457952335478, 4716.339712440261, 4755.191617425037, 4825.8793530161765, 4574.634029277659, 4663.510331415204, 4681.812727490905, 4688.6249100072, 4698.342232087511, 3584.91037724057, 3593.982030089846, 3610.4584312353095, 3613.0967258185456, 3626.1116026573527, 3514.0512061743316, 3537.451694987268, 3576.3920133577353, 3622.366085934964, 3689.778613283198, 3516.5428494295834, 3555.0, 3576.2489877125836, 3590.407582748843, 3601.117726157082, 3565.7860528368383, 3585.0678823505814, 3585.928281434383, 3589.7666651667687, 3606.4229723244284, 3099.1322429719717, 3127.390158919012, 3133.0444214514564, 3138.5762922005465, 3140.0736782649174, 4558.680892337537, 4582.6104781093645, 4583.449986001668, 4592.402987611623, 4606.723596584216, 3993.880183594468, 4086.8160932758096, 4086.9591304086875, 4109.732867363612, 4117.444145040441, 4955.876103097416, 4973.676711013773, 4975.90048199034, 4989.077020751136, 4993.400791904958, 3386.4243078676436, 3415.1803567143957, 3416.9145771355666, 3422.8801991930413, 3425.657434256579, 4922.507749225085, 4973.403191617029, 4991.700497970097, 5029.823956161554, 5088.236764485357, 3394.287199688044, 3411.539442175324, 3416.180116771957, 3434.5363375944426, 3459.996600985736, 3453.447448408293, 3522.5772907251294, 3533.4876442915634, 3550.2721942001826, 3555.1823080691584, 4011.8796436106963, 4027.617376349242, 4048.2510735514024, 4062.431259623655, 4066.6543343815515, 4712.69367491112, 4901.926471102936, 4922.163232250526, 4932.457429682732, 4962.15643340633, 1258.5406326690693, 1264.72808346206, 1272.3765354975994, 1283.1915892987358, 1288.1755676367131, 819.7827575692446, 825.6078362777632, 835.1648351648352, 838.0153319849153, 846.7967687754895, 4647.767611619405, 4690.202665546797, 4692.296155576622, 4729.858104256878, 4750.239961606127, 5070.543651071422, 5146.099432599281, 5150.304708864255, 5167.224916262516, 5171.3535808024, 4657.0918670858855, 4682.157211701926, 4744.5492678195515, 4748.287756836502, 4784.282357646381, 2790.734880186379, 2801.593768903538, 2822.8729707163225, 2826.462972035307, 2856.828590284548, 5124.538791508782, 5176.559992400613, 5274.868128296746, 5300.549453296436, 5316.229146773773, 5202.947970520322, 5236.162214045735, 5257.106291930381, 5276.604254680914, 5292.814751483679, 5225.895482090337, 5226.294450249244, 5264.9210261846865, 5284.735763211824, 5299.761510732026, 4959.504049595012, 5045.344105266292, 5059.0, 5117.897642047213, 5154.0, 4965.329680493087, 5026.798928042837, 5053.090443720165, 5062.670926389773, 5121.206213036985, 5071.290019397361, 5168.8449346519665, 5270.472952704852, 5308.787648494172, 5340.732963351895, 3256.6743325667244, 3305.8842940496966, 3314.6519615440034, 3366.83165841702, 3366.983165084159, 4954.975225123995, 5022.397312322545, 5027.195648696191, 5092.567131793839, 5116.258142569381, 4879.804807807648, 4895.534924182197, 4949.0, 4974.477679843564, 4992.5756310714, 4753.714777113384, 4897.16748152822, 4944.085344211188, 4952.059108769322, 4973.776180071978, 4791.041791641616, 4824.565789079, 4841.733704646278, 4848.61211103118, 4849.854504364875, 4869.513048695102, 4870.659053866196, 4894.9021019578695, 4963.429205641398, 4968.652194346361, 4797.592204662643, 4799.136155492045, 4860.684055536379, 4871.610271178368, 4888.0], "yui.html": [497.487587784582, 505.6334157735641, 545.7653209120077, 606.3996643323111, 609.0590038390686, 10853.0, 10975.945120274408, 10985.780284394317, 10998.670039898805, 11104.167187460953, 9982.351147175428, 10434.634787782428, 10454.790904181911, 10564.894351056488, 10617.256792024562, 548.0983781679136, 551.925490058841, 558.1488230448579, 703.0965209705529, 721.8664547058811, 706.9116360454943, 707.8867381219006, 716.2193209401751, 720.9675564599605, 730.5069078372104, 741.8145463634091, 742.7883053329803, 744.8845428958521, 752.7553545097837, 754.8829931360648, 571.87418767871, 579.8434422705888, 586.1559354529464, 715.667214745146, 749.7975546602441, 536.2117687000103, 536.9382521010094, 542.1813062275952, 542.8045903474746, 543.4619726470805, 10468.214883883664, 10618.309809862334, 10630.681079567625, 10651.84022239667, 10779.892201077968, 8729.170728780819, 8783.78040548985, 8827.867581986275, 8945.105489451067, 9044.638214471413, 7097.858042839166, 7349.55902645843, 7398.49413832354, 7566.886496702554, 7598.924010759877, 2512.1207577347964, 2550.2221822344177, 2597.480503899209, 2621.488809682113, 2682.248970288322, 38411.0, 38501.614983850086, 38551.807240963615, 38632.61367386347, 39061.804690976365, 6899.965500172568, 6906.343897329745, 6974.616396098263, 6978.337057979484, 7020.7542736004, 14609.415623374945, 14704.926475367554, 14822.258887055605, 14872.330745116496, 14877.47928822486, 5112.284280200774, 5165.431802501722, 5178.741062946838, 5266.657667251617, 5279.52484276417, 2814.620026296465, 2888.1913064342016, 2900.753435957925, 2909.229054300612, 2923.166897434221, 2109.725735654386, 2112.968305475419, 2117.2483768262355, 2144.860584062031, 2151.451379898116, 325.3265739918346, 327.5283591628096, 333.03088013879494, 338.6072156298731, 339.36369307548347, 389.690196293947, 438.1980974816079, 438.4234731328293, 459.53816414503876, 467.1241422333125, 5917.977684520366, 6023.939760602338, 6030.517558595302, 6103.969480152571, 6257.74969001244, 338.3182886483737, 345.3231665934746, 426.84420186631655, 429.0, 473.51228234917403, 2714.3214196450886, 2719.252205643464, 2829.688734239232, 2881.0, 2932.941341173207, 43489.0, 43749.78125109354, 43863.12273754507, 44007.339889901676, 48082.0, 39011.41482877702, 39799.20401591952, 40041.79979100144, 40350.59649403527, 42091.7895410521, 36165.45751813725, 36323.27353452916, 37708.16535770043, 38072.42891356632, 38255.0, 6163.599366041193, 6181.3200547938795, 6393.360663933569, 6637.767678131242, 6649.4680425564875, 26578.335541611614, 27641.44717105687, 27740.167794966183, 28642.0, 28665.426691465636, 36529.0, 37059.25881482301, 37489.437658435694, 37863.62136378601, 38072.80963595164, 5469.699166545719, 5855.882882342415, 5927.170196172626, 6180.258368995749, 6186.876262474815, 8481.745547633582, 8544.2310192083, 8647.394682372174, 8719.825603488021, 8730.301575874042, 8167.387445941459, 8249.83500330002, 8250.257476827115, 8286.212809783061, 8308.584570771316, 8195.83608327842, 8255.339572834278, 8329.0, 8347.457415267989, 8354.164583541597, 7906.52560846351, 7927.920720792949, 8000.439969202333, 8005.719799806979, 8062.475939063942, 6962.686679099554, 6984.092068031124, 7394.334509894135, 7603.581803000667, 7839.647215875413, 6959.4432445405255, 7025.411061285687, 7298.197198308076, 7433.9256607433235, 7456.440766942393]}, "summary": {"suite": 5376.6143715643675, "subtests": {"jquery.html": {"filtered": 6869.813375895709, "value": 6869.813375895709}, "dojo.html": {"filtered": 4143.862775266652, "value": 4143.862775266652}, "mootools.html": {"filtered": 3319.149502421265, "value": 3319.149502421265}, "ext.html": {"filtered": 14784.783424669939, "value": 14784.783424669939}, "prototype.html": {"filtered": 3713.317636054926, "value": 3713.317636054926}, "yui.html": {"filtered": 4656.347083338601, "value": 4656.347083338601}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0066"}, "testrun": {"date": 1446816304, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151106030423", "branch": "Firefox", "revision": "cc48981c026c50fdf80d47b040ae1fb8fe99ad07"}}, {"talos_counters": {}, "results": {"audio-dft": [206.0, 205.0, 205.0, 207.0, 207.0, 206.0, 206.0, 207.0, 206.0, 208.0], "ai-astar": [138.0, 140.0, 134.0, 141.0, 141.0, 139.0, 129.0, 142.0, 138.0, 131.0], "imaging-gaussian-blur": [148.0, 157.0, 156.0, 148.0, 149.0, 157.0, 149.0, 149.0, 156.0, 150.0], "audio-beat-detection": [200.0, 165.0, 189.0, 207.0, 168.0, 200.0, 199.0, 169.0, 213.0, 162.0], "json-stringify-tinderbox": [82.0, 85.0, 87.0, 86.0, 89.0, 87.0, 86.0, 86.0, 86.0, 86.0], "stanford-crypto-pbkdf2": [194.0, 180.0, 198.0, 199.0, 198.0, 194.0, 193.0, 195.0, 191.0, 191.0], "json-parse-financial": [69.0, 72.0, 74.0, 73.0, 74.0, 75.0, 74.0, 75.0, 74.0, 77.0], "stanford-crypto-sha256-iterative": [85.0, 93.0, 89.0, 91.0, 92.0, 90.0, 91.0, 92.0, 90.0, 90.0], "audio-fft": [98.0, 98.0, 111.0, 109.0, 87.0, 88.0, 92.0, 105.0, 115.0, 91.0], "imaging-darkroom": [162.0, 162.0, 162.0, 162.0, 162.0, 162.0, 162.0, 162.0, 162.0, 162.0], "stanford-crypto-ccm": [163.0, 166.0, 173.0, 175.0, 167.0, 175.0, 163.0, 175.0, 164.0, 168.0], "audio-oscillator": [124.0, 127.0, 171.0, 114.0, 115.0, 116.0, 159.0, 113.0, 112.0, 163.0], "stanford-crypto-aes": [110.0, 112.0, 109.0, 109.0, 113.0, 111.0, 111.0, 110.0, 129.0, 122.0], "imaging-desaturate": [130.0, 129.0, 130.0, 128.0, 129.0, 136.0, 137.0, 137.0, 135.0, 131.0]}, "summary": {"suite": 1933.5, "subtests": {"audio-fft": {"filtered": 99.4, "value": 99.4}, "stanford-crypto-pbkdf2": {"filtered": 193.3, "value": 193.3}, "audio-beat-detection": {"filtered": 187.2, "value": 187.2}, "stanford-crypto-ccm": {"filtered": 168.9, "value": 168.9}, "imaging-darkroom": {"filtered": 162.0, "value": 162.0}, "json-parse-financial": {"filtered": 73.7, "value": 73.7}, "audio-oscillator": {"filtered": 131.4, "value": 131.4}, "ai-astar": {"filtered": 137.3, "value": 137.3}, "audio-dft": {"filtered": 206.3, "value": 206.3}, "stanford-crypto-sha256-iterative": {"filtered": 90.3, "value": 90.3}, "json-stringify-tinderbox": {"filtered": 86.0, "value": 86.0}, "imaging-gaussian-blur": {"filtered": 151.9, "value": 151.9}, "stanford-crypto-aes": {"filtered": 113.6, "value": 113.6}, "imaging-desaturate": {"filtered": 132.2, "value": 132.2}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0066"}, "testrun": {"date": 1446816304, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151106030423", "branch": "Firefox", "revision": "cc48981c026c50fdf80d47b040ae1fb8fe99ad07"}}, {"talos_counters": {}, "results": {"DeltaBlue": [249.19013207077], "Encrypt": [415.45492314083924], "NavierStokes": [7360.294117647059], "Decrypt": [7299.270072992701], "Splay": [800.0], "Richards": [210.9259649862898], "RegExp": [37611.11111111111], "Earley": [1031.9917440660474], "Boyer": [16095.238095238095], "RayTrace": [2629.9212598425197]}, "summary": {"suite": 14496.23451954301, "subtests": {"DeltaBlue": {"filtered": 265.33153400000003, "value": 265.33153400000003}, "Encrypt": {"filtered": 640.6976669999998, "value": 640.6976669999998}, "NavierStokes": {"filtered": 201.62237762237774, "value": 201.62237762237774}, "Decrypt": {"filtered": 36.466797000000014, "value": 36.466797000000014}, "Splay": {"filtered": 101.86374999999995, "value": 101.86374999999995}, "RegExp": {"filtered": 24.221166912850823, "value": 24.221166912850823}, "Richards": {"filtered": 167.366782, "value": 167.366782}, "Earley": {"filtered": 645.802647, "value": 645.802647}, "Boyer": {"filtered": 41.40746449704143, "value": 41.40746449704143}, "RayTrace": {"filtered": 281.37306287425156, "value": 281.37306287425156}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0066"}, "testrun": {"date": 1446816304, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151106030423", "branch": "Firefox", "revision": "cc48981c026c50fdf80d47b040ae1fb8fe99ad07"}}] 05:45:28 INFO - RETURN: dromaeo_css: 5376.61 05:45:28 INFO - RETURN: kraken: 1933.50 05:45:28 INFO - RETURN: v8_7: 14496.23 05:45:28 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,1,55]]", "result": "14496.23"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,55]]", "result": "1933.50"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,55]]", "result": "5376.61"}}} 05:45:28 INFO - Return code: 0 05:45:28 INFO - # TBPL SUCCESS # 05:45:28 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:45:29 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:45:29 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:45:29 INFO - 2015-11-06 05:45:29.011 screenresolution[1655:9869] starting screenresolution argv=screenresolution get 05:45:29 INFO - 2015-11-06 05:45:29.015 screenresolution[1655:9869] Display 0: 1600x1200x32@60 05:45:29 INFO - 2015-11-06 05:45:29.022 screenresolution[1656:9872] starting screenresolution argv=screenresolution list 05:45:29 INFO - Available Modes on Display 0 05:45:29 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:45:29 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:45:29 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:45:29 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:45:29 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:45:29 INFO - Intel HD Graphics 3000: 05:45:29 INFO - Chipset Model: Intel HD Graphics 3000 05:45:29 INFO - Type: GPU 05:45:29 INFO - Bus: Built-In 05:45:29 INFO - VRAM (Total): 512 MB 05:45:29 INFO - VRAM (Dynamic, Max): 10 05:45:29 INFO - Vendor: Intel (0x8086) 05:45:29 INFO - Device ID: 0x0116 05:45:29 INFO - Revision ID: 0x0009 05:45:29 INFO - Displays: 05:45:29 INFO - Display: 05:45:29 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:45:29 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:45:29 INFO - Display Serial Number: 1600x1200 60 05:45:29 INFO - Main Display: Yes 05:45:29 INFO - Mirror: Off 05:45:29 INFO - Online: Yes 05:45:29 INFO - Rotation: Supported 05:45:29 INFO - Return code: 0 05:45:29 INFO - Running post-action listener: _resource_record_post_action 05:45:29 INFO - Running post-run listener: _resource_record_post_run 05:45:30 INFO - Total resource usage - Wall time: 1271s; CPU: 30.0%; Read bytes: 39523328; Write bytes: 688815104; Read time: 5447; Write time: 54379 05:45:30 INFO - install - Wall time: 46s; CPU: 30.0%; Read bytes: 337076736; Write bytes: 337469440; Read time: 39711; Write time: 6611 05:45:30 INFO - run-tests - Wall time: 1226s; CPU: 30.0%; Read bytes: 38384640; Write bytes: 340990976; Read time: 5060; Write time: 47268 05:45:30 INFO - Running post-run listener: _upload_blobber_files 05:45:30 INFO - Blob upload gear active. 05:45:30 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 05:45:30 INFO - Copying logs to upload dir... 05:45:30 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1334.712182 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 14 secs) (at 2015-11-06 05:45:30.488057) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-06 05:45:30.492031) ========= 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.PF0udq33aU/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.nVWg4x3iFx/Listeners TMPDIR=/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/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:0x0:0x0 using PTY: False build_url:https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011463 build_url: 'https://queue.taskcluster.net/v1/task/gWtvkJ_RSyeKJ5mTkJvrwQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-06 05:45:30.521179) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-06 05:45:30.521525) ========= 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.PF0udq33aU/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.nVWg4x3iFx/Listeners TMPDIR=/var/folders/tf/7nrwnv995j36_qb9gdbgjc7m00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.005997 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-06 05:45:30.571567) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-06 05:45:30.571892) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-06 05:45:30.572252) ========= ========= Total master_lag: 0.23 =========