builder: mozilla-aurora_yosemite_test-dromaeojs slave: t-yosemite-r5-0050 starttime: 1449224112.63 results: success (0) buildid: 20151204004006 builduid: eefa11bc25b64eb4afc02e903e3c5e8e revision: 858b1b930b16a5c46634e3dad2650c517e150cb0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.627868) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.628584) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.629074) ========= 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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners TMPDIR=/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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.005420 basedir: '/builds/slave/test' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.647315) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.647602) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.658147) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.658435) ========= 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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners TMPDIR=/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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.005096 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.706849) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.707155) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.707515) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.707781) ========= 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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners TMPDIR=/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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-12-04 02:15:12-- 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.41G=0s 2015-12-04 02:15:12 (1.41 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.106900 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.828670) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.829251) ========= 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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners TMPDIR=/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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.020646 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.880003) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:12.880348) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 858b1b930b16a5c46634e3dad2650c517e150cb0 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 858b1b930b16a5c46634e3dad2650c517e150cb0 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.WPF3jT3n6P/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.7cRCyvGtt8/Listeners TMPDIR=/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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-12-04 02:15:12,951 truncating revision to first 12 chars 2015-12-04 02:15:12,951 Setting DEBUG logging. 2015-12-04 02:15:12,951 attempt 1/10 2015-12-04 02:15:12,951 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/858b1b930b16?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-04 02:15:13,629 unpacking tar archive at: mozilla-aurora-858b1b930b16/testing/mozharness/ program finished with exit code 0 elapsedTime=0.927453 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:13.819068) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:13.819401) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:13.827437) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:13.827709) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-04 02:15:13.828100) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 33 secs) (at 2015-12-04 02:15:13.828384) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.WPF3jT3n6P/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.7cRCyvGtt8/Listeners TMPDIR=/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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 02:15:14 INFO - MultiFileLogger online at 20151204 02:15:14 in /builds/slave/test 02:15:14 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 02:15:14 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:15:14 INFO - {'append_to_log': False, 02:15:14 INFO - 'base_work_dir': '/builds/slave/test', 02:15:14 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 02:15:14 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:15:14 INFO - 'branch': 'Mozilla-Aurora', 02:15:14 INFO - 'buildbot_json_path': 'buildprops.json', 02:15:14 INFO - 'config_files': ('talos/mac_config.py',), 02:15:14 INFO - 'default_actions': ('clobber', 02:15:14 INFO - 'read-buildbot-config', 02:15:14 INFO - 'download-and-extract', 02:15:14 INFO - 'populate-webroot', 02:15:14 INFO - 'create-virtualenv', 02:15:14 INFO - 'install', 02:15:14 INFO - 'run-tests'), 02:15:14 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:15:14 INFO - 'download_minidump_stackwalk': True, 02:15:14 INFO - 'download_symbols': 'ondemand', 02:15:14 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 02:15:14 INFO - 'tooltool.py': '/tools/tooltool.py', 02:15:14 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 02:15:14 INFO - '/tools/misc-python/virtualenv.py')}, 02:15:14 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:15:14 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:15:14 INFO - 'installer_path': 'installer.exe', 02:15:14 INFO - 'log_level': 'info', 02:15:14 INFO - 'log_name': 'talos', 02:15:14 INFO - 'log_to_console': True, 02:15:14 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 02:15:14 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 02:15:14 INFO - 'opt_config_files': (), 02:15:14 INFO - 'pip_index': False, 02:15:14 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 02:15:14 INFO - 'cmd': ('bash', 02:15:14 INFO - '-c', 02:15:14 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 02:15:14 INFO - 'enabled': True, 02:15:14 INFO - 'halt_on_failure': False, 02:15:14 INFO - 'name': 'check_screen_resolution'},), 02:15:14 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 02:15:14 INFO - 'cmd': ('bash', 02:15:14 INFO - '-c', 02:15:14 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 02:15:14 INFO - 'enabled': True, 02:15:14 INFO - 'halt_on_failure': False, 02:15:14 INFO - 'name': 'check_screen_resolution'},), 02:15:14 INFO - 'run_cmd_checks_enabled': True, 02:15:14 INFO - 'sps_profile': False, 02:15:14 INFO - 'sps_profile_interval': 0, 02:15:14 INFO - 'suite': 'dromaeojs', 02:15:14 INFO - 'system_bits': '64', 02:15:14 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:15:14 INFO - 'title': 't-yosemite-r5-0050', 02:15:14 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:15:14 INFO - 'use_talos_json': True, 02:15:14 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:15:14 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:15:14 INFO - 'work_dir': 'build'} 02:15:14 INFO - ##### 02:15:14 INFO - ##### Running clobber step. 02:15:14 INFO - ##### 02:15:14 INFO - Running pre-action listener: _resource_record_pre_action 02:15:14 INFO - Running main action method: clobber 02:15:14 INFO - rmtree: /builds/slave/test/build 02:15:14 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:15:16 INFO - Running post-action listener: _resource_record_post_action 02:15:16 INFO - ##### 02:15:16 INFO - ##### Running read-buildbot-config step. 02:15:16 INFO - ##### 02:15:16 INFO - Running pre-action listener: _resource_record_pre_action 02:15:16 INFO - Running main action method: read_buildbot_config 02:15:16 INFO - Using buildbot properties: 02:15:16 INFO - { 02:15:16 INFO - "properties": { 02:15:16 INFO - "buildnumber": 296, 02:15:16 INFO - "product": "firefox", 02:15:16 INFO - "script_repo_revision": "production", 02:15:16 INFO - "builddir": "mozilla-aurora_yosemite_test-dromaeojs", 02:15:16 INFO - "repository": "", 02:15:16 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 mozilla-aurora talos dromaeojs", 02:15:16 INFO - "buildid": "20151204004006", 02:15:16 INFO - "slavename": "t-yosemite-r5-0050", 02:15:16 INFO - "stage_platform": "macosx64", 02:15:16 INFO - "basedir": "/builds/slave/test", 02:15:16 INFO - "nightly_build": "True", 02:15:16 INFO - "project": "", 02:15:16 INFO - "platform": "yosemite", 02:15:16 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 02:15:16 INFO - "slavebuilddir": "test", 02:15:16 INFO - "scheduler": "tests-mozilla-aurora-macosx64-talos", 02:15:16 INFO - "branch": "mozilla-aurora", 02:15:16 INFO - "repo_path": "releases/mozilla-aurora", 02:15:16 INFO - "pgo_build": "False", 02:15:16 INFO - "builduid": "eefa11bc25b64eb4afc02e903e3c5e8e", 02:15:16 INFO - "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0" 02:15:16 INFO - }, 02:15:16 INFO - "sourcestamp": { 02:15:16 INFO - "repository": "", 02:15:16 INFO - "hasPatch": false, 02:15:16 INFO - "project": "", 02:15:16 INFO - "branch": "mozilla-aurora-macosx64-talos", 02:15:16 INFO - "changes": [ 02:15:16 INFO - { 02:15:16 INFO - "category": null, 02:15:16 INFO - "files": [ 02:15:16 INFO - { 02:15:16 INFO - "url": null, 02:15:16 INFO - "name": "https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg" 02:15:16 INFO - } 02:15:16 INFO - ], 02:15:16 INFO - "repository": "", 02:15:16 INFO - "rev": "858b1b930b16a5c46634e3dad2650c517e150cb0", 02:15:16 INFO - "who": "sendchange", 02:15:16 INFO - "when": 1449223181, 02:15:16 INFO - "number": 6743552, 02:15:16 INFO - "comments": "", 02:15:16 INFO - "project": "", 02:15:16 INFO - "at": "Fri 04 Dec 2015 01:59:41", 02:15:16 INFO - "branch": "mozilla-aurora-macosx64-talos", 02:15:16 INFO - "revlink": "", 02:15:16 INFO - "properties": [ 02:15:16 INFO - [ 02:15:16 INFO - "buildid", 02:15:16 INFO - "20151204004006", 02:15:16 INFO - "Change" 02:15:16 INFO - ], 02:15:16 INFO - [ 02:15:16 INFO - "builduid", 02:15:16 INFO - "eefa11bc25b64eb4afc02e903e3c5e8e", 02:15:16 INFO - "Change" 02:15:16 INFO - ], 02:15:16 INFO - [ 02:15:16 INFO - "nightly_build", 02:15:16 INFO - "True", 02:15:16 INFO - "Change" 02:15:16 INFO - ], 02:15:16 INFO - [ 02:15:16 INFO - "pgo_build", 02:15:16 INFO - "False", 02:15:16 INFO - "Change" 02:15:16 INFO - ] 02:15:16 INFO - ], 02:15:16 INFO - "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0" 02:15:16 INFO - } 02:15:16 INFO - ], 02:15:16 INFO - "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0" 02:15:16 INFO - } 02:15:16 INFO - } 02:15:16 INFO - Found installer url https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg. 02:15:16 INFO - Running post-action listener: _resource_record_post_action 02:15:16 INFO - ##### 02:15:16 INFO - ##### Running download-and-extract step. 02:15:16 INFO - ##### 02:15:16 INFO - Running pre-action listener: _resource_record_pre_action 02:15:16 INFO - Running main action method: download_and_extract 02:15:16 INFO - mkdir: /builds/slave/test/build/tests 02:15:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:16 INFO - https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 02:15:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/test_packages.json 02:15:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/test_packages.json 02:15:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 02:15:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 02:15:16 INFO - Downloaded 1149 bytes. 02:15:16 INFO - Reading from file /builds/slave/test/build/test_packages.json 02:15:16 INFO - Using the following test package requirements: 02:15:16 INFO - {u'common': [u'firefox-44.0a2.en-US.mac.common.tests.zip'], 02:15:16 INFO - u'cppunittest': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 02:15:16 INFO - u'firefox-44.0a2.en-US.mac.cppunittest.tests.zip'], 02:15:16 INFO - u'jittest': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 02:15:16 INFO - u'jsshell-mac.zip'], 02:15:16 INFO - u'mochitest': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 02:15:16 INFO - u'firefox-44.0a2.en-US.mac.mochitest.tests.zip'], 02:15:16 INFO - u'mozbase': [u'firefox-44.0a2.en-US.mac.common.tests.zip'], 02:15:16 INFO - u'reftest': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 02:15:16 INFO - u'firefox-44.0a2.en-US.mac.reftest.tests.zip'], 02:15:16 INFO - u'talos': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 02:15:16 INFO - u'firefox-44.0a2.en-US.mac.talos.tests.zip'], 02:15:16 INFO - u'web-platform': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 02:15:16 INFO - u'firefox-44.0a2.en-US.mac.web-platform.tests.zip'], 02:15:16 INFO - u'webapprt': [u'firefox-44.0a2.en-US.mac.common.tests.zip'], 02:15:16 INFO - u'xpcshell': [u'firefox-44.0a2.en-US.mac.common.tests.zip', 02:15:16 INFO - u'firefox-44.0a2.en-US.mac.xpcshell.tests.zip']} 02:15:16 INFO - Downloading packages: [u'firefox-44.0a2.en-US.mac.common.tests.zip'] for test suite category: common 02:15:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:16 INFO - https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 02:15:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip 02:15:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip 02:15:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip 02:15:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'}, attempt #1 02:15:17 INFO - Downloaded 17490150 bytes. 02:15:17 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 02:15:17 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip 02:15:17 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'] with output_timeout 1760 02:15:22 INFO - Return code: 0 02:15:22 INFO - Downloading packages: [u'firefox-44.0a2.en-US.mac.common.tests.zip', u'firefox-44.0a2.en-US.mac.talos.tests.zip'] for test suite category: talos 02:15:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:22 INFO - https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 02:15:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip 02:15:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip 02:15:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip 02:15:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'}, attempt #1 02:15:23 INFO - Downloaded 17490150 bytes. 02:15:23 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 02:15:23 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip 02:15:23 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.common.tests.zip'] with output_timeout 1760 02:15:29 INFO - Return code: 0 02:15:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:29 INFO - https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 02:15:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip 02:15:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip 02:15:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip 02:15:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip'}, attempt #1 02:15:30 INFO - Downloaded 11131307 bytes. 02:15:30 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 02:15:30 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip 02:15:30 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a2.en-US.mac.talos.tests.zip'] with output_timeout 1760 02:15:31 INFO - Return code: 0 02:15:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:31 INFO - https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg matches https://queue.taskcluster.net 02:15:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg 02:15:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg 02:15:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg to /builds/slave/test/build/firefox-44.0a2.en-US.mac.dmg 02:15:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-44.0a2.en-US.mac.dmg'}, attempt #1 02:15:34 INFO - Downloaded 108776457 bytes. 02:15:34 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg 02:15:34 INFO - mkdir: /builds/slave/test/properties 02:15:34 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:15:34 INFO - Writing to file /builds/slave/test/properties/build_url 02:15:34 INFO - Contents: 02:15:34 INFO - build_url:https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg 02:15:34 INFO - Running post-action listener: _resource_record_post_action 02:15:34 INFO - Running post-action listener: set_extra_try_arguments 02:15:34 INFO - ##### 02:15:34 INFO - ##### Running populate-webroot step. 02:15:34 INFO - ##### 02:15:34 INFO - Running pre-action listener: _resource_record_pre_action 02:15:34 INFO - Running main action method: populate_webroot 02:15:34 INFO - Guessing talos json url... 02:15:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:34 INFO - https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.txt matches https://queue.taskcluster.net 02:15:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.txt 02:15:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.txt 02:15:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.txt to /builds/slave/test/build/firefox-44.0a2.en-US.mac.txt 02:15:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.txt', 'file_name': '/builds/slave/test/build/firefox-44.0a2.en-US.mac.txt'}, attempt #1 02:15:34 INFO - Downloaded 107 bytes. 02:15:34 INFO - Reading from file /builds/slave/test/build/firefox-44.0a2.en-US.mac.txt 02:15:34 INFO - Contents: 02:15:34 INFO - 20151204004006 02:15:34 INFO - https://hg.mozilla.org/releases/mozilla-aurora/rev/858b1b930b16a5c46634e3dad2650c517e150cb0 02:15:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:34 INFO - trying https://hg.mozilla.org/releases/mozilla-aurora/raw-file/858b1b930b/testing/talos/talos.json 02:15:34 INFO - Downloading https://hg.mozilla.org/releases/mozilla-aurora/raw-file/858b1b930b/testing/talos/talos.json to /builds/slave/test/build/talos.json 02:15:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/releases/mozilla-aurora/raw-file/858b1b930b/testing/talos/talos.json', 'file_name': '/builds/slave/test/build/talos.json'}, attempt #1 02:15:35 INFO - Downloaded 4264 bytes. 02:15:35 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 02:15:35 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 02:15:35 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 02:15:35 INFO - '../fennec_ids.txt'], 02:15:35 INFO - 'tests': ['tcheck2']}, 02:15:35 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 02:15:35 INFO - '--tppagecycles', 02:15:35 INFO - '7'], 02:15:35 INFO - 'tests': ['tsvgm']}}, 02:15:35 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 02:15:35 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['tresize', 'tcanvasmark']}, 02:15:35 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 02:15:35 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 02:15:35 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:15:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:15:35 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:15:35 INFO - 'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:15:35 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:15:35 INFO - 'tests': ['damp', 'tps']}, 02:15:35 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:15:35 INFO - 'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['damp', 'tps']}, 02:15:35 INFO - 'g3': {'tests': ['dromaeo_dom']}, 02:15:35 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:15:35 INFO - 'other': {'tests': ['a11yr', 02:15:35 INFO - 'ts_paint', 02:15:35 INFO - 'tpaint', 02:15:35 INFO - 'sessionrestore', 02:15:35 INFO - 'sessionrestore_no_auto_restore']}, 02:15:35 INFO - 'other-e10s': {'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['a11yr', 02:15:35 INFO - 'ts_paint', 02:15:35 INFO - 'tpaint', 02:15:35 INFO - 'sessionrestore', 02:15:35 INFO - 'sessionrestore_no_auto_restore']}, 02:15:35 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['a11yr', 02:15:35 INFO - 'ts_paint', 02:15:35 INFO - 'tpaint', 02:15:35 INFO - 'sessionrestore', 02:15:35 INFO - 'sessionrestore_no_auto_restore']}, 02:15:35 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['a11yr', 02:15:35 INFO - 'ts_paint', 02:15:35 INFO - 'tpaint', 02:15:35 INFO - 'sessionrestore', 02:15:35 INFO - 'sessionrestore_no_auto_restore']}, 02:15:35 INFO - 'other_l64': {'tests': ['a11yr', 02:15:35 INFO - 'ts_paint', 02:15:35 INFO - 'tpaint', 02:15:35 INFO - 'sessionrestore', 02:15:35 INFO - 'sessionrestore_no_auto_restore']}, 02:15:35 INFO - 'other_nol64': {'tests': ['a11yr', 02:15:35 INFO - 'ts_paint', 02:15:35 INFO - 'tpaint', 02:15:35 INFO - 'sessionrestore', 02:15:35 INFO - 'sessionrestore_no_auto_restore']}, 02:15:35 INFO - 'svgr': {'tests': ['tsvgx', 02:15:35 INFO - 'tsvgr_opacity', 02:15:35 INFO - 'tart', 02:15:35 INFO - 'tscrollx', 02:15:35 INFO - 'cart']}, 02:15:35 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['tsvgx', 02:15:35 INFO - 'tsvgr_opacity', 02:15:35 INFO - 'tart', 02:15:35 INFO - 'tscrollx', 02:15:35 INFO - 'cart']}, 02:15:35 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:15:35 INFO - 'tests': ['tp5o']}, 02:15:35 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:15:35 INFO - 'talos_options': ['--e10s'], 02:15:35 INFO - 'tests': ['tp5o']}, 02:15:35 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:15:35 INFO - 'talos_options': ['--xperf_path', 02:15:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:15:35 INFO - 'tests': ['tp5n']}, 02:15:35 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:15:35 INFO - 'talos_options': ['--e10s', 02:15:35 INFO - '--xperf_path', 02:15:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 02:15:35 INFO - 'C:/slave/talos-data/talos/xperf.config'], 02:15:35 INFO - 'tests': ['tp5n']}}, 02:15:35 INFO - 'talos.zip': {'path': '', 02:15:35 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 02:15:35 INFO - Running post-action listener: _resource_record_post_action 02:15:35 INFO - ##### 02:15:35 INFO - ##### Running create-virtualenv step. 02:15:35 INFO - ##### 02:15:35 INFO - Running pre-action listener: _resource_record_pre_action 02:15:35 INFO - Running main action method: create_virtualenv 02:15:35 INFO - Creating virtualenv /builds/slave/test/build/venv 02:15:35 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 02:15:35 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 02:15:35 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:15:35 INFO - Using real prefix '/tools/python27' 02:15:35 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:15:36 INFO - Installing distribute.............................................................................................................................................................................................done. 02:15:39 INFO - Installing pip.................done. 02:15:39 INFO - Return code: 0 02:15:39 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:15: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')]} 02:15:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15: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')]} 02:15:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:39 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 0x10280aa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102877228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fedabd85910>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1027bf9f0>, '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 0x10251ecd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102789990>, '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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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 02:15:39 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 02:15:39 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 02:15:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.WPF3jT3n6P/Render', 02:15:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:15:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:15:39 INFO - 'HOME': '/Users/cltbld', 02:15:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:15:39 INFO - 'LOGNAME': 'cltbld', 02:15:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:39 INFO - 'MOZ_NO_REMOTE': '1', 02:15:39 INFO - 'NO_EM_RESTART': '1', 02:15:39 INFO - 'PAGER': '/bin/cat', 02:15:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:15:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:39 INFO - 'PWD': '/builds/slave/test', 02:15:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:15:39 INFO - 'SHELL': '/bin/bash', 02:15:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7cRCyvGtt8/Listeners', 02:15:39 INFO - 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/', 02:15:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:15:39 INFO - 'USER': 'cltbld', 02:15:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:15:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:15:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:39 INFO - 'XPC_FLAGS': '0x0', 02:15:39 INFO - 'XPC_SERVICE_NAME': '0', 02:15:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 02:15:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:39 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 02:15:39 INFO - Cleaning up... 02:15:39 INFO - Return code: 0 02:15:39 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 02:15: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')]} 02:15:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15: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')]} 02:15:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:39 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 0x10280aa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102877228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fedabd85910>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1027bf9f0>, '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 0x10251ecd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102789990>, '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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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 02:15:39 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 02:15:39 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 02:15:39 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.WPF3jT3n6P/Render', 02:15:39 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:15:39 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:15:39 INFO - 'HOME': '/Users/cltbld', 02:15:39 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:15:39 INFO - 'LOGNAME': 'cltbld', 02:15:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:39 INFO - 'MOZ_NO_REMOTE': '1', 02:15:39 INFO - 'NO_EM_RESTART': '1', 02:15:39 INFO - 'PAGER': '/bin/cat', 02:15:39 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:15:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:39 INFO - 'PWD': '/builds/slave/test', 02:15:39 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:15:39 INFO - 'SHELL': '/bin/bash', 02:15:39 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7cRCyvGtt8/Listeners', 02:15:39 INFO - 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/', 02:15:39 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:15:39 INFO - 'USER': 'cltbld', 02:15:39 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:15:39 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:15:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:39 INFO - 'XPC_FLAGS': '0x0', 02:15:39 INFO - 'XPC_SERVICE_NAME': '0', 02:15:39 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 02:15:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:40 INFO - Downloading/unpacking psutil>=0.7.1 02:15:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:42 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 02:15:42 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 02:15:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:15:42 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:15:42 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:15:42 INFO - Installing collected packages: psutil 02:15:42 INFO - Running setup.py install for psutil 02:15:42 INFO - building 'psutil._psutil_osx' extension 02:15:42 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 02:15:43 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 02:15:43 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 02:15:43 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 02:15:43 INFO - building 'psutil._psutil_posix' extension 02:15:43 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 02:15:43 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 02:15:43 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 02:15:43 INFO - ^ 02:15:43 INFO - 1 warning generated. 02:15:43 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 02:15:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:15:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:15:43 INFO - Successfully installed psutil 02:15:43 INFO - Cleaning up... 02:15:43 INFO - Return code: 0 02:15:43 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 02:15:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:43 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 0x10280aa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102877228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fedabd85910>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1027bf9f0>, '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 0x10251ecd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102789990>, '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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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 02:15:43 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 02:15:43 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 02:15:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.WPF3jT3n6P/Render', 02:15:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:15:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:15:43 INFO - 'HOME': '/Users/cltbld', 02:15:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:15:43 INFO - 'LOGNAME': 'cltbld', 02:15:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:43 INFO - 'MOZ_NO_REMOTE': '1', 02:15:43 INFO - 'NO_EM_RESTART': '1', 02:15:43 INFO - 'PAGER': '/bin/cat', 02:15:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:15:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:43 INFO - 'PWD': '/builds/slave/test', 02:15:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:15:43 INFO - 'SHELL': '/bin/bash', 02:15:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7cRCyvGtt8/Listeners', 02:15:43 INFO - 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/', 02:15:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:15:43 INFO - 'USER': 'cltbld', 02:15:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:15:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:15:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:43 INFO - 'XPC_FLAGS': '0x0', 02:15:43 INFO - 'XPC_SERVICE_NAME': '0', 02:15:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 02:15:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:43 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 02:15:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:46 INFO - Downloading mozsystemmonitor-0.0.tar.gz 02:15:46 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 02:15:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:15:46 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 02:15:46 INFO - Installing collected packages: mozsystemmonitor 02:15:46 INFO - Running setup.py install for mozsystemmonitor 02:15:46 INFO - Successfully installed mozsystemmonitor 02:15:46 INFO - Cleaning up... 02:15:46 INFO - Return code: 0 02:15:46 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:15: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')]} 02:15:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15: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')]} 02:15:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15: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', '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 0x10280aa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102877228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fedabd85910>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1027bf9f0>, '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 0x10251ecd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102789990>, '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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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 02:15: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 02:15: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 blobuploader==1.2.4 02:15:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.WPF3jT3n6P/Render', 02:15:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:15:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:15:46 INFO - 'HOME': '/Users/cltbld', 02:15:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:15:46 INFO - 'LOGNAME': 'cltbld', 02:15:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:46 INFO - 'MOZ_NO_REMOTE': '1', 02:15:46 INFO - 'NO_EM_RESTART': '1', 02:15:46 INFO - 'PAGER': '/bin/cat', 02:15:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:15:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:46 INFO - 'PWD': '/builds/slave/test', 02:15:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:15:46 INFO - 'SHELL': '/bin/bash', 02:15:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7cRCyvGtt8/Listeners', 02:15:46 INFO - 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/', 02:15:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:15:46 INFO - 'USER': 'cltbld', 02:15:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:15:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:15:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:46 INFO - 'XPC_FLAGS': '0x0', 02:15:46 INFO - 'XPC_SERVICE_NAME': '0', 02:15:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 02:15:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:46 INFO - Downloading/unpacking blobuploader==1.2.4 02:15:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:49 INFO - Downloading blobuploader-1.2.4.tar.gz 02:15:49 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 02:15:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:15:49 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:15:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:49 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 02:15:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:15:49 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:15:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:50 INFO - Downloading docopt-0.6.1.tar.gz 02:15:50 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 02:15:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:15:50 INFO - Installing collected packages: blobuploader, requests, docopt 02:15:50 INFO - Running setup.py install for blobuploader 02:15:50 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:15:50 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:15:50 INFO - Running setup.py install for requests 02:15:51 INFO - Running setup.py install for docopt 02:15:51 INFO - Successfully installed blobuploader requests docopt 02:15:51 INFO - Cleaning up... 02:15:51 INFO - Return code: 0 02:15:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:15:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:51 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 0x10280aa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102877228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fedabd85910>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1027bf9f0>, '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 0x10251ecd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102789990>, '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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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 02:15:51 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 02:15:51 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 02:15:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.WPF3jT3n6P/Render', 02:15:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:15:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:15:51 INFO - 'HOME': '/Users/cltbld', 02:15:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:15:51 INFO - 'LOGNAME': 'cltbld', 02:15:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:51 INFO - 'MOZ_NO_REMOTE': '1', 02:15:51 INFO - 'NO_EM_RESTART': '1', 02:15:51 INFO - 'PAGER': '/bin/cat', 02:15:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:15:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:51 INFO - 'PWD': '/builds/slave/test', 02:15:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:15:51 INFO - 'SHELL': '/bin/bash', 02:15:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7cRCyvGtt8/Listeners', 02:15:51 INFO - 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/', 02:15:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:15:51 INFO - 'USER': 'cltbld', 02:15:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:15:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:15:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:51 INFO - 'XPC_FLAGS': '0x0', 02:15:51 INFO - 'XPC_SERVICE_NAME': '0', 02:15:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 02:15:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:15:51 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-OcaWck-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:15:51 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-9TadvN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:15:51 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-26Wjz7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:15:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:15:51 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-Fnmhjv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:15:52 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-a2BH3P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:15:52 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-vM81bR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:15:52 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-VP3DmB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:15:52 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-6ETHVt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:15:52 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-tHRdFg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:15:52 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-oU0_Tw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:15:52 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-ktkZPo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:15:52 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-4yg4OB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:15:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:15:53 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-_VpF7i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:15:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:15:53 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-Qj85qW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:15:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:15:53 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-RLVJ6v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:15:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:15:53 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-8WXxuB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:15:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:15:53 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-eyymMZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:15:53 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:15:53 INFO - Running setup.py install for manifestparser 02:15:53 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:15:53 INFO - Running setup.py install for mozcrash 02:15:53 INFO - Running setup.py install for mozdebug 02:15:54 INFO - Running setup.py install for mozdevice 02:15:54 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 02:15:54 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:15:54 INFO - Running setup.py install for mozfile 02:15:54 INFO - Running setup.py install for mozhttpd 02:15:54 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:15:54 INFO - Running setup.py install for mozinfo 02:15:54 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:15:54 INFO - Running setup.py install for mozInstall 02:15:54 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:15:54 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:15:54 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:15:54 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:15:54 INFO - Running setup.py install for mozleak 02:15:54 INFO - Running setup.py install for mozlog 02:15:55 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:15:55 INFO - Running setup.py install for moznetwork 02:15:55 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:15:55 INFO - Running setup.py install for mozprocess 02:15:55 INFO - Running setup.py install for mozprofile 02:15:55 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:15:55 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:15:55 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:15:55 INFO - Running setup.py install for mozrunner 02:15:55 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:15:55 INFO - Running setup.py install for mozscreenshot 02:15:56 INFO - Running setup.py install for moztest 02:15:56 INFO - Running setup.py install for mozversion 02:15:56 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:15:56 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:15:56 INFO - Cleaning up... 02:15:56 INFO - Return code: 0 02:15:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:15:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:56 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 0x10280aa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102877228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fedabd85910>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1027bf9f0>, '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 0x10251ecd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102789990>, '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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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 02:15:56 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 02:15:56 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 02:15:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.WPF3jT3n6P/Render', 02:15:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:15:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:15:56 INFO - 'HOME': '/Users/cltbld', 02:15:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:15:56 INFO - 'LOGNAME': 'cltbld', 02:15:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:56 INFO - 'MOZ_NO_REMOTE': '1', 02:15:56 INFO - 'NO_EM_RESTART': '1', 02:15:56 INFO - 'PAGER': '/bin/cat', 02:15:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:15:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:56 INFO - 'PWD': '/builds/slave/test', 02:15:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:15:56 INFO - 'SHELL': '/bin/bash', 02:15:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7cRCyvGtt8/Listeners', 02:15:56 INFO - 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/', 02:15:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:15:56 INFO - 'USER': 'cltbld', 02:15:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:15:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:15:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:56 INFO - 'XPC_FLAGS': '0x0', 02:15:56 INFO - 'XPC_SERVICE_NAME': '0', 02:15:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 02:15:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:15:56 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-7meyhW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:15:56 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 02:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:15:56 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-gitQ7n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:15:56 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)) 02:15:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:15:56 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-Ub6jeF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:15:57 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-1PSxea-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.46 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:15:57 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-DHO6RU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:15:57 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-7NlfYV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:15:57 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-Aiyxqz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.8 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:15:57 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-P39CFV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:15:57 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-bUoRp8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:15:57 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-LXtX7G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:15:57 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)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:15:57 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-LpWikm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:15:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 02:15:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:15:58 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-kSvlGy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:15:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 02:15:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:15:58 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-SApcHL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:15:58 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)) 02:15:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:15:58 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-0Oz08m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:15:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 02:15:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:15:58 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-GZClKs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:15:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 02:15:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:15:58 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-yKrMIo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:15:58 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 02:15:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:15:58 INFO - Running setup.py (path:/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/pip-jR5d3i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:15:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 02:15:58 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)) 02:15:58 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)) 02:15:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 02:15:58 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.46->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:15:58 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.46->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:15:58 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:15: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 02:15: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 02:15: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 02:15: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 02:15: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 02:15: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 02:16:00 INFO - Downloading blessings-1.5.1.tar.gz 02:16:01 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 02:16:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:16:01 INFO - Installing collected packages: blessings 02:16:01 INFO - Running setup.py install for blessings 02:16:01 INFO - Successfully installed blessings 02:16:01 INFO - Cleaning up... 02:16:01 INFO - Return code: 0 02:16:01 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:16:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:16:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:16:01 INFO - Reading from file tmpfile_stdout 02:16:01 INFO - Current package versions: 02:16:01 INFO - blessings == 1.5.1 02:16:01 INFO - blobuploader == 1.2.4 02:16:01 INFO - docopt == 0.6.1 02:16:01 INFO - manifestparser == 1.1 02:16:01 INFO - mozInstall == 1.12 02:16:01 INFO - mozcrash == 0.16 02:16:01 INFO - mozdebug == 0.1 02:16:01 INFO - mozdevice == 0.46 02:16:01 INFO - mozfile == 1.2 02:16:01 INFO - mozhttpd == 0.7 02:16:01 INFO - mozinfo == 0.8 02:16:01 INFO - mozleak == 0.1 02:16:01 INFO - mozlog == 3.0 02:16:01 INFO - moznetwork == 0.27 02:16:01 INFO - mozprocess == 0.22 02:16:01 INFO - mozprofile == 0.27 02:16:01 INFO - mozrunner == 6.11 02:16:01 INFO - mozscreenshot == 0.1 02:16:01 INFO - mozsystemmonitor == 0.0 02:16:01 INFO - moztest == 0.7 02:16:01 INFO - mozversion == 1.4 02:16:01 INFO - psutil == 3.1.1 02:16:01 INFO - requests == 1.2.3 02:16:01 INFO - wsgiref == 0.1.2 02:16:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:16:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:16:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:16:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:16:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:16:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:16:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:16:01 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 0x10280aa30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x102877228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fedabd85910>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1027bf9f0>, '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 0x10251ecd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102789990>, '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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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 02:16:01 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 02:16:01 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 02:16:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.WPF3jT3n6P/Render', 02:16:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:16:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:16:01 INFO - 'HOME': '/Users/cltbld', 02:16:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:16:01 INFO - 'LOGNAME': 'cltbld', 02:16:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:16:01 INFO - 'MOZ_NO_REMOTE': '1', 02:16:01 INFO - 'NO_EM_RESTART': '1', 02:16:01 INFO - 'PAGER': '/bin/cat', 02:16:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:16:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:16:01 INFO - 'PWD': '/builds/slave/test', 02:16:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:16:01 INFO - 'SHELL': '/bin/bash', 02:16:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7cRCyvGtt8/Listeners', 02:16:01 INFO - 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/', 02:16:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:16:01 INFO - 'USER': 'cltbld', 02:16:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:16:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:16:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:16:01 INFO - 'XPC_FLAGS': '0x0', 02:16:01 INFO - 'XPC_SERVICE_NAME': '0', 02:16:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 02:16:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 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)) 02:16:01 INFO - Cleaning up... 02:16:02 INFO - Return code: 0 02:16:02 INFO - Running post-action listener: _resource_record_post_action 02:16:02 INFO - Running post-action listener: _start_resource_monitoring 02:16:02 INFO - Starting resource monitoring. 02:16:02 INFO - ##### 02:16:02 INFO - ##### Running install step. 02:16:02 INFO - ##### 02:16:02 INFO - Running pre-action listener: _resource_record_pre_action 02:16:02 INFO - Running main action method: install 02:16:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:16:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:16:02 INFO - Reading from file tmpfile_stdout 02:16:02 INFO - Detecting whether we're running mozinstall >=1.0... 02:16:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:16:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:16:02 INFO - Reading from file tmpfile_stdout 02:16:02 INFO - Output received: 02:16:02 INFO - Usage: mozinstall [options] installer 02:16:02 INFO - Options: 02:16:02 INFO - -h, --help show this help message and exit 02:16:02 INFO - -d DEST, --destination=DEST 02:16:02 INFO - Directory to install application into. [default: 02:16:02 INFO - "/builds/slave/test"] 02:16:02 INFO - --app=APP Application being installed. [default: firefox] 02:16:02 INFO - mkdir: /builds/slave/test/build/application 02:16:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-44.0a2.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 02:16:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-44.0a2.en-US.mac.dmg --destination /builds/slave/test/build/application 02:16:37 INFO - Reading from file tmpfile_stdout 02:16:37 INFO - Output received: 02:16:37 INFO - /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox 02:16:37 INFO - Running post-action listener: _resource_record_post_action 02:16:37 INFO - ##### 02:16:37 INFO - ##### Running run-tests step. 02:16:37 INFO - ##### 02:16:37 INFO - Running pre-action listener: _resource_record_pre_action 02:16:37 INFO - Running main action method: run_tests 02:16:37 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 02:16:37 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 02:16:37 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 02:16:37 INFO - 2015-12-04 02:16:37.688 screenresolution[1942:13251] starting screenresolution argv=screenresolution get 02:16:37 INFO - 2015-12-04 02:16:37.691 screenresolution[1942:13251] Display 0: 1600x1200x32@60 02:16:37 INFO - 2015-12-04 02:16:37.697 screenresolution[1943:13253] starting screenresolution argv=screenresolution list 02:16:37 INFO - Available Modes on Display 0 02:16:37 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 02:16:37 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 02:16:37 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 02:16:37 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 02:16:37 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 02:16:37 INFO - Intel HD Graphics 3000: 02:16:37 INFO - Chipset Model: Intel HD Graphics 3000 02:16:37 INFO - Type: GPU 02:16:37 INFO - Bus: Built-In 02:16:37 INFO - VRAM (Total): 512 MB 02:16:37 INFO - VRAM (Dynamic, Max): 10 02:16:37 INFO - Vendor: Intel (0x8086) 02:16:37 INFO - Device ID: 0x0116 02:16:37 INFO - Revision ID: 0x0009 02:16:37 INFO - Displays: 02:16:37 INFO - Display: 02:16:37 INFO - Resolution: 1600 x 1200 @ 60 Hz 02:16:37 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 02:16:37 INFO - Display Serial Number: 1600x1200 60 02:16:37 INFO - Main Display: Yes 02:16:37 INFO - Mirror: Off 02:16:37 INFO - Online: Yes 02:16:37 INFO - Rotation: Supported 02:16:37 INFO - Return code: 0 02:16:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:16:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:16:37 INFO - Python 2.7.3 02:16:37 INFO - Return code: 0 02:16:37 INFO - grabbing minidump binary from tooltool 02:16:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:16:37 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 0x1027bf9f0>, '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 0x10251ecd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x102789990>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:16:37 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 02:16:37 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 02:16:38 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:16:38 INFO - Return code: 0 02:16:38 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 02:16:38 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:16:38 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:16:38 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 02:16:38 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:16:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0050', '--webServer', 'localhost'] in /builds/slave/test/build 02:16:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0050 --webServer localhost 02:16:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.WPF3jT3n6P/Render', 02:16:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:16:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:16:38 INFO - 'HOME': '/Users/cltbld', 02:16:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:16:38 INFO - 'LOGNAME': 'cltbld', 02:16:38 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:16:38 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 02:16:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:16:38 INFO - 'MOZ_NO_REMOTE': '1', 02:16:38 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:16:38 INFO - 'NO_EM_RESTART': '1', 02:16:38 INFO - 'PAGER': '/bin/cat', 02:16:38 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:16:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:16:38 INFO - 'PWD': '/builds/slave/test', 02:16:38 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:16:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:16:38 INFO - 'SHELL': '/bin/bash', 02:16:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.7cRCyvGtt8/Listeners', 02:16:38 INFO - 'TMPDIR': '/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/', 02:16:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:16:38 INFO - 'USER': 'cltbld', 02:16:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:16:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:16:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:16:38 INFO - 'XPC_FLAGS': '0x0', 02:16:38 INFO - 'XPC_SERVICE_NAME': '0', 02:16:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 02:16:38 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0050', '--webServer', 'localhost'] with output_timeout 3600 02:16:38 INFO - mozversion INFO | application_buildid: 20151204004006 02:16:38 INFO - mozversion INFO | application_changeset: 858b1b930b16a5c46634e3dad2650c517e150cb0 02:16:38 INFO - mozversion INFO | application_display_name: FirefoxDeveloperEdition 02:16:38 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:16:38 INFO - mozversion INFO | application_name: Firefox 02:16:38 INFO - mozversion INFO | application_remotingname: firefox-dev 02:16:38 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/releases/mozilla-aurora 02:16:38 INFO - mozversion INFO | application_vendor: Mozilla 02:16:38 INFO - mozversion INFO | application_version: 44.0a2 02:16:38 INFO - mozversion INFO | platform_buildid: 20151204004006 02:16:38 INFO - mozversion INFO | platform_changeset: 858b1b930b16a5c46634e3dad2650c517e150cb0 02:16:38 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 02:16:38 INFO - mozversion INFO | platform_version: 44.0a2 02:16:38 INFO - 2015-12-04 02:16:38,272 DEBUG : using testdate: 1449224198 02:16:38 INFO - 2015-12-04 02:16:38,272 DEBUG : actual date: 1449224198 02:16:38 INFO - 2015-12-04 02:16:38,350 INFO : starting webserver on 'localhost:51249' 02:16:38 INFO - 2015-12-04 02:16:38,351 INFO : Starting test suite t-yosemite-r5-0050 02:16:38 INFO - 2015-12-04 02:16:38,352 INFO : Starting test dromaeo_css 02:16:38 INFO - 2015-12-04 02:16:38,352 DEBUG : operating with platform_type : mac_ 02:16:38 INFO - 2015-12-04 02:16:38,353 INFO : Initialising browser for dromaeo_css test... 02:16:38 INFO - 2015-12-04 02:16:38,365 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/tmpTP_BGH/profile http://localhost:51249/getInfo.html 02:16:40 INFO - 2015-12-04 02:16:40,430 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 02:16:40 INFO - 2015-12-04 02:16:40,430 DEBUG : BROWSER_OUTPUT: colorDepth:24 02:16:40 INFO - 2015-12-04 02:16:40,430 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 02:16:40 INFO - 2015-12-04 02:16:40,431 DEBUG : BROWSER_OUTPUT: __metrics 02:16:40 INFO - 2015-12-04 02:16:40,448 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 02:16:41 INFO - 2015-12-04 02:16:41,046 INFO : Browser initialized. 02:16:41 INFO - 2015-12-04 02:16:41,046 INFO : Running cycle 1/1 for dromaeo_css test... 02:16:41 INFO - 2015-12-04 02:16:41,047 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/tmpTP_BGH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 02:16:52 INFO - 2015-12-04 02:16:52,829 DEBUG : BROWSER_OUTPUT: RSS: Main: 198885376 02:16:52 INFO - 2015-12-04 02:16:52,829 DEBUG : BROWSER_OUTPUT: 02:17:44 INFO - 2015-12-04 02:17:44,542 DEBUG : BROWSER_OUTPUT: 1449224264541 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 02:19:55 INFO - 2015-12-04 02:19:55,040 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51249/tests/dromaeo/cssquery-ext.html) 02:19:56 INFO - 2015-12-04 02:19:56,207 DEBUG : BROWSER_OUTPUT: RSS: Main: 317411328 02:19:56 INFO - 2015-12-04 02:19:56,207 DEBUG : BROWSER_OUTPUT: 02:22:58 INFO - 2015-12-04 02:22:58,662 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/dromaeo/cssquery-ext.html (next: http://localhost:51249/tests/dromaeo/cssquery-jquery.html) 02:22:59 INFO - 2015-12-04 02:22:59,249 DEBUG : BROWSER_OUTPUT: RSS: Main: 340258816 02:22:59 INFO - 2015-12-04 02:22:59,249 DEBUG : BROWSER_OUTPUT: 02:26:01 INFO - 2015-12-04 02:26:01,335 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51249/tests/dromaeo/cssquery-mootools.html) 02:26:01 INFO - 2015-12-04 02:26:01,918 DEBUG : BROWSER_OUTPUT: RSS: Main: 311668736 02:26:01 INFO - 2015-12-04 02:26:01,918 DEBUG : BROWSER_OUTPUT: 02:29:03 INFO - 2015-12-04 02:29:03,795 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51249/tests/dromaeo/cssquery-prototype.html) 02:29:04 INFO - 2015-12-04 02:29:04,386 DEBUG : BROWSER_OUTPUT: RSS: Main: 295911424 02:29:04 INFO - 2015-12-04 02:29:04,386 DEBUG : BROWSER_OUTPUT: 02:32:07 INFO - 2015-12-04 02:32:07,308 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51249/tests/dromaeo/cssquery-yui.html) 02:32:07 INFO - 2015-12-04 02:32:07,916 DEBUG : BROWSER_OUTPUT: RSS: Main: 297484288 02:32:07 INFO - 2015-12-04 02:32:07,916 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,630 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/dromaeo/cssquery-yui.html (next: http://localhost:51249/tests/dromaeo/cssquery-dojo.html) 02:35:10 INFO - 2015-12-04 02:35:10,889 DEBUG : BROWSER_OUTPUT: RSS: Main: 344662016 02:35:10 INFO - 2015-12-04 02:35:10,889 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,889 DEBUG : BROWSER_OUTPUT: __start_tp_report 02:35:10 INFO - 2015-12-04 02:35:10,889 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 02:35:10 INFO - 2015-12-04 02:35:10,889 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 02:35:10 INFO - 2015-12-04 02:35:10,890 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 02:35:10 INFO - 2015-12-04 02:35:10,890 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3138.356636889438;3257.2182676157713;3263.135269153674;3280.278338765471;3295.769296149269;5355.277037599923;5426.837194884155;5430.647007944486;5449.64577302475;5461.563074954004;5345.893082138355;5540.307461567304;5540.889182216363;5557.77768889245;5577.944220557793;4977.303177555145;4987.650864439491;5060.1650727630085;5080.84757457275;5106.259592359124;4852.2479015752615;4940.431850337203;5013.373328333958;5038.949610503903;5043.949560504403;5118.488151184889;5139.922901156467;5146.562542183919;5147.48525147486;5180.222966555009;4797.280407938802;4911.926321105187;5076.74616269185;5113.744312784346;5119.36007999002;4912.803487860481;5005.599552035865;5006.924896126561;5029.119904016819;5046.09170349337;5312.282841816383;5487.204355368449;5498.917516237259;5516.613837031409;5552.416996215379;5518.862028449281;5666.320041594994;5674.801381951612;5867.237259156325;5909.9704501477645;5720.1991721159075;5816.941830581683;5831.562632802556;5833;5837.620554663976;5529.142982837667;5560.555155587503;5583.441655834466;5587.413321601254;5588.329400471888;5455.699936503531;5549.5837812164245;5860.970695146582;6067.939320606825;6075.969620151871;5719.2279042328755;5730.054541000688;5733.455321744427;5740.454656807597;5808.186853840466;5863.442972917566;5863.618864773862;5865.824025279248;5881.794137205177;5887.264091988502;5640.097584386478;5655.179998900218;5773.769049237983;5784.537237021028;5785.681787501644;5648.661080335193;5807.186993820868;5820.621659592113;5825.0679891217205;5848.181254624356;4528.207563676344;4529.592336689714;4534.115847409789;4538.183127037165;4568.794404251817;3853.4412510185866;3942.1130245695063;3952.466417033721;4068.7762173080764;4136.31750761127;5456.454354564512;5476.17857321397;5478.013957487611;5492.286002819608;5492.286002819608;5919;5924.5852790305125;5935.376785437553;5935.904961843498;5937.495312898365;5242.423333433319;5328.973355133277;5338.225957236179;5352.705601191894;5440.6735595864375;5177.58579313654;5244.842654720364;5245.1345527988215;5260.105782017066;5272.077386457355;6018.21763170785;6032.215811944331;6036.879262414815;6040.2751669798145;6045.123457098696;5650.660960342392;5740.13897915316;5769.711514424346;5779.971100144472;5850.5904586678525;5885.823425297248;5955.285365756137;5956.910646340395;5965.6718880461995;5984.102384642339;5817.301923769175;5822.912656310244;5826.563007774349;5840.853978650398;5852.678102704393;5636.098224284095;5759.2512973313205;5775.8556036099435;5824.970875145597;5934.020886553671;5810.418958104325;5821.417858214145;5824.184614153937;5826.70866456684;5837.912431313619;5818.50542703858;5823.155642431739;5827.8834423310445;5830.737616807169;5838.795642152504;5396.163594642837;5418.295621569171;5528.530074943675;5532.585056120887;5550.666959982414;5763.7406316715005;5808.419158084158;5811.128330750421;5815.738291776795;5825.242718446575;5706.828795136153;5713.114467257582;5718.027935250934;5722.0272553665145;5722.2561067061015 02:35:10 INFO - 2015-12-04 02:35:10,890 DEBUG : BROWSER_OUTPUT: |1;ext.html;563.8674911395822;596.9343372229055;606.6087373643996;607.9878402431953;615.5844804756788;32234.194145146383;39081;39319.80340098303;39408.2118357633;39463.40804887929;41728;42164;42228.36657450141;42274.15451690972;42308.36537451933;8739.868901966443;8883.73348799537;9346.06539346065;9506.049395060472;9515.429074255531;10937.289076210021;11145.665630031112;11175.44122793861;11210.66368008957;11243.550257989671;11123;11234.49444774987;11266.211365204439;11312.490937907773;11322.433878306092;8938.016818149998;9106.453612783254;11096.611618593352;11200.327980321166;11348.432578371048;11047.558097676083;11172.273802202912;11199.768025517267;11201.551937922555;11234;38954.41568376477;39309.80345098256;39321.606783932366;39382.803085984386;39392;3114.5639610454555;3232.5474433579316;3520.5951315598777;3658.6937343259224;3695.7043436525014;26913.730862691318;27148.45703085947;27295.72704272952;27608.309792255353;27622.723772762216;2425.745296743834;2466.136852101768;2486.4405508760565;2496.0764517128596;2600.9089681861046;267221;267599.6620016907;270573;271006;271645;52843;53777.31113444312;65557.34442655512;66612.33387666158;66663.66668166628;59593;60021.69989150026;60071.49463790233;60122.098168527504;60162;17742;18028.36900708469;18208.271669133086;18224.726629100573;18240.361587344378;13820.239886806121;13848.930755346159;14009.929950350182;14083.084599501;14149.221792801289;19227.423177304703;19366.806331936783;19604.803951960585;19643.803561964483;19666.70499942502;8698.695545655872;8796.067569927864;8833;8905.33210009239;8936.24041956441;974.3910056214866;981.6613268422383;998.121652945418;1047.157038583932;1120.0143873391364;27913.30216744557;28202.43595128086;28351.29121771931;28640.71359286422;28658.713412866022;1044.3420644993605;1105.3147048829776;1123.477582923928;1137.726945533066;1219.4699463017566;13798.586042418743;14508.709825803426;14646.560603181708;14801.185934773475;14878.181700006604;224186;227068;227611;227626;228146;47133;47899.281510777364;47989;50106.49893501091;50228.24657630138;1454.1711224602086;1477.062065588359;1479.5191562742152;1490.180400779567;1491.5525342397239;26126.86936565305;29536.409271814875;29706.851465742533;29795.255118622208;30200;43543.12913741771;44185.779071104436;45802;48625.270620941425;49628;264049;266736;269339;269727;270573;31984.68015319817;32095;32670.83664581662;32903.506447402826;33320.833395832866;41642;42246.78876605597;42490.57509424866;43818.56181438145;43990.780046099564;35104.82447587848;36825.44761828521;36910.8154459226;37228.25543489061;37646.435303471015;35075.47386789251;35960.51253926289;36215.45676814902;36408;36456;33708.157296067795;34213;34475;34479.44842482044;34481.31037379288;26271.737282626927;26633.733662663126;32042.19894502563;32272.193195170308;32290.35419291648;24661.87669061643;24913.750862491142;25075.373115672253;25173.49653006893;25372 02:35:10 INFO - 2015-12-04 02:35:10,890 DEBUG : BROWSER_OUTPUT: |2;jquery.html;362.11824208053395;363.1810267846009;365.0945654776155;365.1364522903331;369.2835898357186;15122.24388780562;15336.61658458539;17821.198046087924;18999.145038473267;19847.20611175553;14811.851881481181;14815.407383704665;15411.76882346763;17062.976221426725;18195.818041819577;5526.253955715977;5555.527780138673;5665.348484924245;5666.235058267122;5705.65766054036;4199.979000104995;4317.071829556645;5594.188842617838;5627.324721033461;5982.012967860298;6069.0592958091565;6090.26916769986;6117.480014198798;6121.785737499188;6123.632582045091;4725.456572494173;4812.013537224861;4825.686330388514;4830;6060.1212824140475;3984.880453586397;4069.918601627951;4071.043304823364;4074.4295798588223;4084.6323830855067;12068;13212.471501139942;13449.394777235048;13475.258860762655;13492.460301587924;1908.9331873384365;1926.1524929031182;1956.158851693771;2003.6994450832347;2101.873887566751;9816.950915245377;9880.851787223197;9934.602615895355;10239.795204095877;10241;1618.1504710027211;1631.8776091793163;1638.6476907464832;1662.9002259864446;1664.5172899859026;60080.399196007915;61805.69097154531;61825.38174618286;61863.6906815472;62276;6364.1408409865;6464.967675161594;6508.414242718178;6516.446102081376;6529.902051469232;7404.148522919933;7430.071241094864;7434.1822399536;7437.107547094383;7439.8140046499275;5705.5150312223095;5741.598088133874;5754.971225143848;5770.278715160605;5772.884542309214;6335.746570137143;6346.238451385863;6349.555531112777;6376.139221205078;6389.2652344980925;3033.8179709217516;3042.406730687539;3052.5421186822155;3066.23344163959;3069.5395690646583;1031.1338475680313;1039.1219419590434;1075.7740874416304;1109.1071687291808;1124.6401151631562;421.50052188157133;433.92840181370354;441.05834044315617;445.29420867924057;452.8822506148425;11661.825072623917;11888.524459021715;12277.263364198177;12292.446839892227;12307.20003199807;417.60744899794093;417.8391319342014;419.93700944857903;428.44944246642916;462.13349968808484;6370.235571731422;6473.385028422293;6575.835604109936;6592.406683398517;6635.8009259722285;566492;578073;581748;588256;591422;65313.67343163254;71617.64191179011;73190.63404683048;73965.2603473969;75498.24501755022;422.6323098903973;431.8833914842975;467.7824811462686;483.66868694944077;484.27842514653616;11291.491882865455;11380.146489013192;11468.713282168013;11711.941440292743;11714.765704685688;35283;35654.821725891205;35798.4630230552;36331;36784.632153679195;47417.05165896732;47614.523854761006;47785.28322075241;48288;48307.75846120747;6281.371862813682;6323.177986861862;6327.905081423874;6339.619622822645;6339.746410143543;12198.57304994321;12285.201461904948;12296.139270250997;12354.196977196454;12436.005119590593;10606.840897386699;10658.840117398091;10784.946075269887;10786.685325869401;10830.729231769268;9915.702528924145;9927.950360248153;9980.900190998287;10071.949640251752;10444.373337599769;9145;10559.15526757873;10631.840522392326;10705.250632455653;10934.507947142238;5783.884322313615;5955.553333500092;6153.661548614869;6274.529410294337;6343.270523889812;10627.36235825853;10708.57165713394;10724.195685323475;10815.242932994615;10920.235583509397 02:35:10 INFO - 2015-12-04 02:35:10,891 DEBUG : BROWSER_OUTPUT: |3;mootools.html;961.6874515782373;1748.659011492759;1824.232958939789;1828.5154434074973;1833.9633207335853;6801.863962720742;7075.85848283034;7237.31245531675;7253.891191632129;7264.418846492281;7227.385672217868;7383.187849336582;7404.7778566642955;7426.034615499977;7428.777136685908;2217.7782221777775;2231.665250212465;2233.486298151426;2234.452559123009;2234.54191890662;2221.1559607349263;2248.0895237428867;2251.0770584060538;2251.549690061986;2254.1546919905036;2165.9133634654595;2191.8465707400487;2233.7877901599404;2246.3485589179118;2249.3701763506247;2149.6453085241073;2175.3582693105573;2179.18280644759;2181.1275489804048;2181.1602533024898;2240.630296001158;2250.0437314141586;2250.1674380479326;2253.211376018397;2255.853369530975;6632.701528431232;6847.691853866588;7289.70841166358;7334.779956601311;7349.889751653729;4478.440194975628;4590.495045544987;4602.309653551961;4605.470370907355;4607.14767767964;2836.248394175545;2878.194105650421;2914.446255211503;2919.5328747400313;2929.868155932988;838.8993320801543;839.2530647723531;848.8811566380712;858.7767180533044;892.3307519360479;9377.953110234474;9492.905070949271;9508.524573771352;9534.427934323894;9540.522973851279;4071.5114186297833;4094.160697057096;4130.545639979599;4135.441715368447;4200.033992181815;8466.068732439428;8466.915330846612;8475.618597163142;8479.279261262862;8492.617832197566;4704.506026867198;4710.481846996828;4711.199096153662;4712.670113092051;4713.67004309695;4295.570442955679;4296.806643701041;4301.333293339538;4306.65546756265;4307.966088138886;3340.331933613287;3350.0787283497234;3352.027911905569;3364.7308215342714;3390.304987477561;1053.1469509697017;1057.6826951914395;1059.7032830807386;1063.2291588598205;1065.7016035509914;1062.7874425115008;1076.1982323169132;1077.3751224289892;1198.7123090458226;1328.6014195741238;6817.897731534031;6847.520673552804;6862.794116176523;6871.6564171791215;6896.517243792886;432.3126229295435;437.7132977899481;439.7845055922575;440.2515723270453;442.104737905737;5277.736113194325;5505.889882202334;5543.722813859291;5544.972275138599;5557.36090349615;7913.723019694283;8176.672933082729;8377.287930525974;8377.37169712274;8382.455140415854;8143.837123257502;8308.335333173332;8314.459560128693;8334.12491688376;8342.416030877901;6881.965590172117;6938.826529336807;6966.79099627012;6972.895406569007;6973.093497845349;6723.596584204964;6783.762568310085;6785.93214067853;6786.355296246848;6795.320467953363;7659.387249020177;7774.455788094779;7834.0599128105;7835.5690437026515;7840.764777056697;7950.840983180188;7957.7612671619945;7966.92033079685;7968.402369822171;7988.041435027834;6272.121902933502;6443.806685799434;6535.836604084746;6538.117354157128;6562.048502967138;7023.894641580483;7081.575105493687;7094.396976257076;7099.716011359487;7101.325374089453;6536.7712130075215;6649.700763465752;6663.933360666331;6732.831679208059;6749.42629876466;6553.541252112306;6557.770478033246;6604.471642268511;6619.3380661933425;6639.634820084942;6658.7336506539195;6704.195496540251;6722.563033402813;6734.09089772894;6738.528303018742;6146.969265153645;6173.660448675187;6182.598131121463;6188.721507532082;6194.535409844189;6248.781292654735;6260.436560709376;6283.968580157253;6285.465735412541;6294.968525157345 02:35:10 INFO - 2015-12-04 02:35:10,893 DEBUG : BROWSER_OUTPUT: |4;prototype.html;302.5703501028539;312.5390049676727;316.80041573808495;321.826213844524;325.29735770735215;6128.816135515942;6180.59826111303;6282.403171698693;6298.937010629898;6319.620822750632;6159.753609855612;6166.599171053889;6246.968765156168;6250.9062364064575;6258.030005349178;4728.078024785168;4734.266188740742;4737.147313483571;4745.738984355877;4756.310335001423;4591;4653.930191047137;4678.555537223959;4750.453697824742;4758.857234282959;4672.462666793312;4703.223968045286;4709.623230141598;4729.550692684206;4737.099951009314;4698.130845793522;4709.411323584552;4710.999999999983;4712.976435117803;4718.622510199176;4076.653484453825;4077.429159917614;4078.714489985702;4078.9802549362657;4086.080631857838;5838.795642152547;6017.518598512109;6069.57512974092;6101.694915254219;6108.633481991051;5388.407275199725;5389.137737961946;5396.568274538027;5407.161889907032;5414.729263536808;6551.3121122281955;6564.770233041869;6566.047923051178;6569.310222426672;6573.441257493118;4272.829086836523;4343.283358245885;4473.239549276631;4475.373447717322;4479.70881892676;6611.702473388709;6730.461563074991;6776.15298087739;6841.3842754151865;6857.519973601849;4319.373690814814;4350.630196433339;4354.586314300136;4355.477342718894;4373.169097871394;4451.955480445219;4453.910921781546;4458.398116254329;4460.0633866887665;4461.732296062247;5104.055749686246;5231.686098834082;5245.108331583564;5245.26566280721;5271.20931860224;6643.435307998778;6644;6647.833804154935;6660.733570657217;6678.298778628271;1597.8961367511074;1618.6438983423627;1619.5141457562684;1619.9757003644954;1621.9295265125197;994.721477986165;1015.1320620869051;1018.6129270877168;1018.9439580822977;1022.3916769522123;6292;6292.119103325538;6296.590721603081;6303.180586523723;6315.684215789192;6907.378335949788;6917.273686262971;6918.515703900679;6935.445164386837;6950.096487456598;6103.969480152571;6293.339199383999;6295.527835412362;6306.747730090837;6310;3768;3812.733108682421;3815.275097731422;3825.5983121771815;3836.55879573847;6968.268331825187;6988.825279368057;6995.510314278054;7003.3346832050875;7017.508774385744;6956.5478243913985;7071.858562828715;7077.469189810785;7085.0435191248525;7089.14930208368;6940;6950.513464057569;6951.061606683134;6959.6868140933775;6965.303469653197;6861.4853885957755;6866.690998904961;6885.793426197222;6898.482613803884;6910.654467276516;6592.76925307612;6616.305287944697;6704.296048914794;6715.127033485615;6724.092247546519;6891.965540172468;6900.7929762107215;6962.686679099554;6986.9650651746415;7003.1596208453275;4205.894852628709;4257;4262.531121576686;4262.55243199472;4264.701470897007;6653.401193892573;6800.217974932748;6835.4189893859575;6841.076454678754;6842.076319696777;6627.403533681992;6641.402273795188;6662.367075127855;6686.498512611671;6743.325667433413;6728.428083612752;6734.6295953721055;6735.966320168368;6740.191177058784;6742.69657865407;6365.586236894587;6565;6565.540412171103;6578.868422631616;6603.20761508622;6741.494387920828;6754.696038678173;6756.864862702817;6763.053172555945;6773.729050838108;6557.573757705733;6581.572197807127;6587.0448784926875;6600.702968366531;6605.1083103780375 02:35:10 INFO - 2015-12-04 02:35:10,896 DEBUG : BROWSER_OUTPUT: |5;yui.html;721.1490441279288;741.3661319571765;778.8487362358629;801.3669201330947;804.091376744279;13890.30548472576;14268.785968210484;14300.4994825181;14317.284135793208;14324.713505729878;14720.484783032596;14866.55400337989;14914.552563423087;14925.477608283685;14936.775948360782;726.3354031061573;736.8857827036818;898.0166717444404;900.0369604523163;912.0378001208722;894.552723638181;895.2524641923969;899.029048627484;910.804177101923;910.9498977556232;947.0766003146911;956.7273327101777;956.7560272130597;957.195955397466;957.5978089202517;757.9393648508106;764.747633281016;931.8602209668536;948.5494390164652;951.4434056077204;690.3338278561213;692.594832023267;692.8094773937157;693.012457248424;694.0768777525878;14335.56993290203;14519.419223231058;14522.346494407777;14523.854761452461;14530.782038269434;9628.47043412612;9678.128968392879;9885.950570247174;9941.502924853728;10544;8641.611127499214;9187.219086377667;9437.669681561112;9819.754506137333;9977.650782222587;2957.896473623413;3065.70875766804;3148.323110531224;3169.7464202863716;3185.9964111304866;48253;49634;49773;49865.25202121971;49927.00145997096;7234.819129521698;7272.709091636381;7284.380827629605;7296.233895440902;7315.085614298213;12090.637280881587;12095.334756588472;12103.515859365527;12110.091743119301;12125.878741212475;6476.287608363076;6503.804885853432;6644.900326495106;6699.665016749143;6734.494912881553;3889.2999260132883;3931.2161670890823;3942.40863870416;4007.479027726377;4037.4953130858644;2835.7873159512706;2871.224769312316;2875.1087162979125;2876.5109931311727;2881.1212580162833;422.54576330444894;428.64208385997415;430.0860671073968;431.09470112763574;478.1417355846264;464.6863367227108;576.7058800012024;601.7502736364447;612.3294991983771;651.4267444648774;8290.958545207235;8413.242808147295;8542.40203185771;8565.143485651384;8588.957055214683;516.6951498615834;534.7727215933213;560.7897038610521;570.6205373426708;639.1754636518839;3709.2581483703366;4013.3779264214095;4113.136241389282;4116.197341518435;4325.740455572675;60511;60945.695271524244;61138.38861611327;61535.38464615386;61549.69225153846;52436;54041;54144.729276354155;55019.17471237935;55225;53151.20273195905;54028.45971540313;54184.45815541794;54668.90662186734;54846;8599.097094805205;8684.956575217084;8808.559572021246;8925.642974281216;8993.350581762188;37163.44254836126;37384.252314954094;37709.24581508409;38157.2368552633;38390.616093839824;46236;46390.76804615955;46464.767676161406;47109.52890471051;47297.29054064123;10635.787284254426;11106.055985241022;11288.153388496059;11564.363959981945;11756.23584467007;11332.206745527734;11393.943030285127;11434.599789007345;11707.414629268673;12077;10656.946715266684;11018.614348497764;11084.667459976214;11101.333919964505;11161.162912781736;10398.844017339594;10995.615153469591;11029.503672334604;11078.446077695922;11264.83102753443;10839.241253112206;10883.401412922365;10921.83617245726;10966.506507207036;10980.176486763365;9281.303902207226;9342.95328523353;9496.382735122195;9627.855582166134;9708.368956017835;9570.425774453555;9872.85190722154;9903.78524507572;9910.950445247727;9974.052465015811 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: __end_tp_report 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: __start_cc_report 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,935 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: __end_cc_report 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: __startTimestamp1449225310882__endTimestamp 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: Number of tests: 6 02:35:10 INFO - 2015-12-04 02:35:10,897 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,898 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5436.71 Median:5588.33 stddev:589.30 (10.5%) stddev-sans-first:562.85 02:35:10 INFO - 2015-12-04 02:35:10,898 DEBUG : BROWSER_OUTPUT: Values: 3138.4 3257.2 3263.1 3280.3 3295.8 5355.3 5426.8 5430.6 5449.6 5461.6 5345.9 5540.3 5540.9 5557.8 5577.9 4977.3 4987.7 5060.2 5080.8 5106.3 4852.2 4940.4 5013.4 5038.9 5043.9 5118.5 5139.9 5146.6 5147.5 5180.2 4797.3 4911.9 5076.7 5113.7 5119.4 4912.8 5005.6 5006.9 5029.1 5046.1 5312.3 5487.2 5498.9 5516.6 5552.4 5518.9 5666.3 5674.8 5867.2 5910.0 5720.2 5816.9 5831.6 5833.0 5837.6 5529.1 5560.6 5583.4 5587.4 5588.3 5455.7 5549.6 5861.0 6067.9 6076.0 5719.2 5730.1 5733.5 5740.5 5808.2 5863.4 5863.6 5865.8 5881.8 5887.3 5640.1 5655.2 5773.8 5784.5 5785.7 5648.7 5807.2 5820.6 5825.1 5848.2 4528.2 4529.6 4534.1 4538.2 4568.8 3853.4 3942.1 3952.5 4068.8 4136.3 5456.5 5476.2 5478.0 5492.3 5492.3 5919.0 5924.6 5935.4 5935.9 5937.5 5242.4 5329.0 5338.2 5352.7 5440.7 5177.6 5244.8 5245.1 5260.1 5272.1 6018.2 6032.2 6036.9 6040.3 6045.1 5650.7 5740.1 5769.7 5780.0 5850.6 5885.8 5955.3 5956.9 5965.7 5984.1 5817.3 5822.9 5826.6 5840.9 5852.7 5636.1 5759.3 5775.9 5825.0 5934.0 5810.4 5821.4 5824.2 5826.7 5837.9 5818.5 5823.2 5827.9 5830.7 5838.8 5396.2 5418.3 5528.5 5532.6 5550.7 5763.7 5808.4 5811.1 5815.7 5825.2 5706.8 5713.1 5718.0 5722.0 5722.3 02:35:10 INFO - 2015-12-04 02:35:10,898 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,898 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:43344.59 Median:29997.63 stddev:66333.10 (221.1%) stddev-sans-first:66441.40 02:35:10 INFO - 2015-12-04 02:35:10,899 DEBUG : BROWSER_OUTPUT: Values: 563.9 596.9 606.6 608.0 615.6 32234.2 39081.0 39319.8 39408.2 39463.4 41728.0 42164.0 42228.4 42274.2 42308.4 8739.9 8883.7 9346.1 9506.0 9515.4 10937.3 11145.7 11175.4 11210.7 11243.6 11123.0 11234.5 11266.2 11312.5 11322.4 8938.0 9106.5 11096.6 11200.3 11348.4 11047.6 11172.3 11199.8 11201.6 11234.0 38954.4 39309.8 39321.6 39382.8 39392.0 3114.6 3232.5 3520.6 3658.7 3695.7 26913.7 27148.5 27295.7 27608.3 27622.7 2425.7 2466.1 2486.4 2496.1 2600.9 267221.0 267599.7 270573.0 271006.0 271645.0 52843.0 53777.3 65557.3 66612.3 66663.7 59593.0 60021.7 60071.5 60122.1 60162.0 17742.0 18028.4 18208.3 18224.7 18240.4 13820.2 13848.9 14009.9 14083.1 14149.2 19227.4 19366.8 19604.8 19643.8 19666.7 8698.7 8796.1 8833.0 8905.3 8936.2 974.4 981.7 998.1 1047.2 1120.0 27913.3 28202.4 28351.3 28640.7 28658.7 1044.3 1105.3 1123.5 1137.7 1219.5 13798.6 14508.7 14646.6 14801.2 14878.2 224186.0 227068.0 227611.0 227626.0 228146.0 47133.0 47899.3 47989.0 50106.5 50228.2 1454.2 1477.1 1479.5 1490.2 1491.6 26126.9 29536.4 29706.9 29795.3 30200.0 43543.1 44185.8 45802.0 48625.3 49628.0 264049.0 266736.0 269339.0 269727.0 270573.0 31984.7 32095.0 32670.8 32903.5 33320.8 41642.0 42246.8 42490.6 43818.6 43990.8 35104.8 36825.4 36910.8 37228.3 37646.4 35075.5 35960.5 36215.5 36408.0 36456.0 33708.2 34213.0 34475.0 34479.4 34481.3 26271.7 26633.7 32042.2 32272.2 32290.4 24661.9 24913.8 25075.4 25173.5 25372.0 02:35:10 INFO - 2015-12-04 02:35:10,899 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,900 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:28151.26 Median:2374.48 stddev:95141.60 (4006.8%) stddev-sans-first:95385.61 02:35:10 INFO - 2015-12-04 02:35:10,900 DEBUG : BROWSER_OUTPUT: Values: 362.1 363.2 365.1 365.1 369.3 15122.2 15336.6 17821.2 18999.1 19847.2 14811.9 14815.4 15411.8 17063.0 18195.8 5526.3 5555.5 5665.3 5666.2 5705.7 4200.0 4317.1 5594.2 5627.3 5982.0 6069.1 6090.3 6117.5 6121.8 6123.6 4725.5 4812.0 4825.7 4830.0 6060.1 3984.9 4069.9 4071.0 4074.4 4084.6 12068.0 13212.5 13449.4 13475.3 13492.5 1908.9 1926.2 1956.2 2003.7 2101.9 9817.0 9880.9 9934.6 10239.8 10241.0 1618.2 1631.9 1638.6 1662.9 1664.5 60080.4 61805.7 61825.4 61863.7 62276.0 6364.1 6465.0 6508.4 6516.4 6529.9 7404.1 7430.1 7434.2 7437.1 7439.8 5705.5 5741.6 5755.0 5770.3 5772.9 6335.7 6346.2 6349.6 6376.1 6389.3 3033.8 3042.4 3052.5 3066.2 3069.5 1031.1 1039.1 1075.8 1109.1 1124.6 421.5 433.9 441.1 445.3 452.9 11661.8 11888.5 12277.3 12292.4 12307.2 417.6 417.8 419.9 428.4 462.1 6370.2 6473.4 6575.8 6592.4 6635.8 566492.0 578073.0 581748.0 588256.0 591422.0 65313.7 71617.6 73190.6 73965.3 75498.2 422.6 431.9 467.8 483.7 484.3 11291.5 11380.1 11468.7 11711.9 11714.8 35283.0 35654.8 35798.5 36331.0 36784.6 47417.1 47614.5 47785.3 48288.0 48307.8 6281.4 6323.2 6327.9 6339.6 6339.7 12198.6 12285.2 12296.1 12354.2 12436.0 10606.8 10658.8 10784.9 10786.7 10830.7 9915.7 9928.0 9980.9 10071.9 10444.4 9145.0 10559.2 10631.8 10705.3 10934.5 5783.9 5955.6 6153.7 6274.5 6343.3 10627.4 10708.6 10724.2 10815.2 10920.2 02:35:10 INFO - 2015-12-04 02:35:10,900 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,900 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5114.43 Median:6489.82 stddev:2588.02 (39.9%) stddev-sans-first:2576.44 02:35:10 INFO - 2015-12-04 02:35:10,902 DEBUG : BROWSER_OUTPUT: Values: 961.7 1748.7 1824.2 1828.5 1834.0 6801.9 7075.9 7237.3 7253.9 7264.4 7227.4 7383.2 7404.8 7426.0 7428.8 2217.8 2231.7 2233.5 2234.5 2234.5 2221.2 2248.1 2251.1 2251.5 2254.2 2165.9 2191.8 2233.8 2246.3 2249.4 2149.6 2175.4 2179.2 2181.1 2181.2 2240.6 2250.0 2250.2 2253.2 2255.9 6632.7 6847.7 7289.7 7334.8 7349.9 4478.4 4590.5 4602.3 4605.5 4607.1 2836.2 2878.2 2914.4 2919.5 2929.9 838.9 839.3 848.9 858.8 892.3 9378.0 9492.9 9508.5 9534.4 9540.5 4071.5 4094.2 4130.5 4135.4 4200.0 8466.1 8466.9 8475.6 8479.3 8492.6 4704.5 4710.5 4711.2 4712.7 4713.7 4295.6 4296.8 4301.3 4306.7 4308.0 3340.3 3350.1 3352.0 3364.7 3390.3 1053.1 1057.7 1059.7 1063.2 1065.7 1062.8 1076.2 1077.4 1198.7 1328.6 6817.9 6847.5 6862.8 6871.7 6896.5 432.3 437.7 439.8 440.3 442.1 5277.7 5505.9 5543.7 5545.0 5557.4 7913.7 8176.7 8377.3 8377.4 8382.5 8143.8 8308.3 8314.5 8334.1 8342.4 6882.0 6938.8 6966.8 6972.9 6973.1 6723.6 6783.8 6785.9 6786.4 6795.3 7659.4 7774.5 7834.1 7835.6 7840.8 7950.8 7957.8 7966.9 7968.4 7988.0 6272.1 6443.8 6535.8 6538.1 6562.0 7023.9 7081.6 7094.4 7099.7 7101.3 6536.8 6649.7 6663.9 6732.8 6749.4 6553.5 6557.8 6604.5 6619.3 6639.6 6658.7 6704.2 6722.6 6734.1 6738.5 6147.0 6173.7 6182.6 6188.7 6194.5 6248.8 6260.4 6284.0 6285.5 6295.0 02:35:10 INFO - 2015-12-04 02:35:10,902 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,902 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5481.05 Median:6294.43 stddev:1704.24 (27.1%) stddev-sans-first:1664.11 02:35:10 INFO - 2015-12-04 02:35:10,903 DEBUG : BROWSER_OUTPUT: Values: 302.6 312.5 316.8 321.8 325.3 6128.8 6180.6 6282.4 6298.9 6319.6 6159.8 6166.6 6247.0 6250.9 6258.0 4728.1 4734.3 4737.1 4745.7 4756.3 4591.0 4653.9 4678.6 4750.5 4758.9 4672.5 4703.2 4709.6 4729.6 4737.1 4698.1 4709.4 4711.0 4713.0 4718.6 4076.7 4077.4 4078.7 4079.0 4086.1 5838.8 6017.5 6069.6 6101.7 6108.6 5388.4 5389.1 5396.6 5407.2 5414.7 6551.3 6564.8 6566.0 6569.3 6573.4 4272.8 4343.3 4473.2 4475.4 4479.7 6611.7 6730.5 6776.2 6841.4 6857.5 4319.4 4350.6 4354.6 4355.5 4373.2 4452.0 4453.9 4458.4 4460.1 4461.7 5104.1 5231.7 5245.1 5245.3 5271.2 6643.4 6644.0 6647.8 6660.7 6678.3 1597.9 1618.6 1619.5 1620.0 1621.9 994.7 1015.1 1018.6 1018.9 1022.4 6292.0 6292.1 6296.6 6303.2 6315.7 6907.4 6917.3 6918.5 6935.4 6950.1 6104.0 6293.3 6295.5 6306.7 6310.0 3768.0 3812.7 3815.3 3825.6 3836.6 6968.3 6988.8 6995.5 7003.3 7017.5 6956.5 7071.9 7077.5 7085.0 7089.1 6940.0 6950.5 6951.1 6959.7 6965.3 6861.5 6866.7 6885.8 6898.5 6910.7 6592.8 6616.3 6704.3 6715.1 6724.1 6892.0 6900.8 6962.7 6987.0 7003.2 4205.9 4257.0 4262.5 4262.6 4264.7 6653.4 6800.2 6835.4 6841.1 6842.1 6627.4 6641.4 6662.4 6686.5 6743.3 6728.4 6734.6 6736.0 6740.2 6742.7 6365.6 6565.0 6565.5 6578.9 6603.2 6741.5 6754.7 6756.9 6763.1 6773.7 6557.6 6581.6 6587.0 6600.7 6605.1 02:35:10 INFO - 2015-12-04 02:35:10,904 DEBUG : BROWSER_OUTPUT: 02:35:10 INFO - 2015-12-04 02:35:10,904 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:14036.57 Median:27281.62 stddev:17248.31 (63.2%) stddev-sans-first:17267.72 02:35:10 INFO - 2015-12-04 02:35:10,905 DEBUG : BROWSER_OUTPUT: Values: 721.1 741.4 778.8 801.4 804.1 13890.3 14268.8 14300.5 14317.3 14324.7 14720.5 14866.6 14914.6 14925.5 14936.8 726.3 736.9 898.0 900.0 912.0 894.6 895.3 899.0 910.8 910.9 947.1 956.7 956.8 957.2 957.6 757.9 764.7 931.9 948.5 951.4 690.3 692.6 692.8 693.0 694.1 14335.6 14519.4 14522.3 14523.9 14530.8 9628.5 9678.1 9886.0 9941.5 10544.0 8641.6 9187.2 9437.7 9819.8 9977.7 2957.9 3065.7 3148.3 3169.7 3186.0 48253.0 49634.0 49773.0 49865.3 49927.0 7234.8 7272.7 7284.4 7296.2 7315.1 12090.6 12095.3 12103.5 12110.1 12125.9 6476.3 6503.8 6644.9 6699.7 6734.5 3889.3 3931.2 3942.4 4007.5 4037.5 2835.8 2871.2 2875.1 2876.5 2881.1 422.5 428.6 430.1 431.1 478.1 464.7 576.7 601.8 612.3 651.4 8291.0 8413.2 8542.4 8565.1 8589.0 516.7 534.8 560.8 570.6 639.2 3709.3 4013.4 4113.1 4116.2 4325.7 60511.0 60945.7 61138.4 61535.4 61549.7 52436.0 54041.0 54144.7 55019.2 55225.0 53151.2 54028.5 54184.5 54668.9 54846.0 8599.1 8685.0 8808.6 8925.6 8993.4 37163.4 37384.3 37709.2 38157.2 38390.6 46236.0 46390.8 46464.8 47109.5 47297.3 10635.8 11106.1 11288.2 11564.4 11756.2 11332.2 11393.9 11434.6 11707.4 12077.0 10656.9 11018.6 11084.7 11101.3 11161.2 10398.8 10995.6 11029.5 11078.4 11264.8 10839.2 10883.4 10921.8 10966.5 10980.2 9281.3 9343.0 9496.4 9627.9 9708.4 9570.4 9872.9 9903.8 9911.0 9974.1 02:35:10 INFO - 2015-12-04 02:35:10,905 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 02:35:10 INFO - 2015-12-04 02:35:10,905 DEBUG : BROWSER_OUTPUT: 02:35:11 INFO - 2015-12-04 02:35:11,539 INFO : Browser exited with error code: 0 02:35:11 INFO - 2015-12-04 02:35:11,566 INFO : Completed test dromaeo_css (00:18:33) 02:35:11 INFO - 2015-12-04 02:35:11,566 INFO : Starting test kraken 02:35:11 INFO - 2015-12-04 02:35:11,566 DEBUG : operating with platform_type : mac_ 02:35:11 INFO - 2015-12-04 02:35:11,566 INFO : Initialising browser for kraken test... 02:35:11 INFO - 2015-12-04 02:35:11,579 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/tmpPxBOWN/profile http://localhost:51249/getInfo.html 02:35:13 INFO - 2015-12-04 02:35:13,793 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 02:35:13 INFO - 2015-12-04 02:35:13,793 DEBUG : BROWSER_OUTPUT: colorDepth:24 02:35:13 INFO - 2015-12-04 02:35:13,793 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 02:35:13 INFO - 2015-12-04 02:35:13,793 DEBUG : BROWSER_OUTPUT: __metrics 02:35:13 INFO - 2015-12-04 02:35:13,810 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 02:35:14 INFO - 2015-12-04 02:35:14,415 INFO : Browser initialized. 02:35:14 INFO - 2015-12-04 02:35:14,416 INFO : Running cycle 1/1 for kraken test... 02:35:14 INFO - 2015-12-04 02:35:14,416 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/tmpPxBOWN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 02:35:26 INFO - 2015-12-04 02:35:26,192 DEBUG : BROWSER_OUTPUT: RSS: Main: 197885952 02:35:26 INFO - 2015-12-04 02:35:26,192 DEBUG : BROWSER_OUTPUT: 02:35:28 INFO - 2015-12-04 02:35:28,737 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51249/tests/kraken/driver.html?testName=audio-beat-detection) 02:35:29 INFO - 2015-12-04 02:35:29,315 DEBUG : BROWSER_OUTPUT: RSS: Main: 263081984 02:35:29 INFO - 2015-12-04 02:35:29,316 DEBUG : BROWSER_OUTPUT: 02:35:31 INFO - 2015-12-04 02:35:31,950 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51249/tests/kraken/driver.html?testName=audio-dft) 02:35:32 INFO - 2015-12-04 02:35:32,520 DEBUG : BROWSER_OUTPUT: RSS: Main: 275918848 02:35:32 INFO - 2015-12-04 02:35:32,520 DEBUG : BROWSER_OUTPUT: 02:35:35 INFO - 2015-12-04 02:35:35,381 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51249/tests/kraken/driver.html?testName=audio-fft) 02:35:35 INFO - 2015-12-04 02:35:35,956 DEBUG : BROWSER_OUTPUT: RSS: Main: 261128192 02:35:35 INFO - 2015-12-04 02:35:35,956 DEBUG : BROWSER_OUTPUT: 02:35:38 INFO - 2015-12-04 02:35:38,012 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51249/tests/kraken/driver.html?testName=audio-oscillator) 02:35:38 INFO - 2015-12-04 02:35:38,598 DEBUG : BROWSER_OUTPUT: RSS: Main: 263614464 02:35:38 INFO - 2015-12-04 02:35:38,598 DEBUG : BROWSER_OUTPUT: 02:35:40 INFO - 2015-12-04 02:35:40,807 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51249/tests/kraken/driver.html?testName=imaging-gaussian-blur) 02:35:41 INFO - 2015-12-04 02:35:41,381 DEBUG : BROWSER_OUTPUT: RSS: Main: 262418432 02:35:41 INFO - 2015-12-04 02:35:41,381 DEBUG : BROWSER_OUTPUT: 02:35:44 INFO - 2015-12-04 02:35:44,425 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51249/tests/kraken/driver.html?testName=imaging-darkroom) 02:35:45 INFO - 2015-12-04 02:35:45,009 DEBUG : BROWSER_OUTPUT: RSS: Main: 263884800 02:35:45 INFO - 2015-12-04 02:35:45,009 DEBUG : BROWSER_OUTPUT: 02:35:48 INFO - 2015-12-04 02:35:48,126 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51249/tests/kraken/driver.html?testName=imaging-desaturate) 02:35:48 INFO - 2015-12-04 02:35:48,710 DEBUG : BROWSER_OUTPUT: RSS: Main: 262434816 02:35:48 INFO - 2015-12-04 02:35:48,710 DEBUG : BROWSER_OUTPUT: 02:35:51 INFO - 2015-12-04 02:35:51,563 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51249/tests/kraken/driver.html?testName=json-parse-financial) 02:35:52 INFO - 2015-12-04 02:35:52,144 DEBUG : BROWSER_OUTPUT: RSS: Main: 263454720 02:35:52 INFO - 2015-12-04 02:35:52,144 DEBUG : BROWSER_OUTPUT: 02:35:53 INFO - 2015-12-04 02:35:53,752 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51249/tests/kraken/driver.html?testName=json-stringify-tinderbox) 02:35:54 INFO - 2015-12-04 02:35:54,314 DEBUG : BROWSER_OUTPUT: RSS: Main: 298262528 02:35:54 INFO - 2015-12-04 02:35:54,314 DEBUG : BROWSER_OUTPUT: 02:35:56 INFO - 2015-12-04 02:35:56,135 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51249/tests/kraken/driver.html?testName=stanford-crypto-aes) 02:35:56 INFO - 2015-12-04 02:35:56,750 DEBUG : BROWSER_OUTPUT: RSS: Main: 298876928 02:35:56 INFO - 2015-12-04 02:35:56,750 DEBUG : BROWSER_OUTPUT: 02:35:58 INFO - 2015-12-04 02:35:58,800 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51249/tests/kraken/driver.html?testName=stanford-crypto-ccm) 02:35:59 INFO - 2015-12-04 02:35:59,372 DEBUG : BROWSER_OUTPUT: RSS: Main: 303628288 02:35:59 INFO - 2015-12-04 02:35:59,372 DEBUG : BROWSER_OUTPUT: 02:36:01 INFO - 2015-12-04 02:36:01,901 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51249/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 02:36:02 INFO - 2015-12-04 02:36:02,489 DEBUG : BROWSER_OUTPUT: RSS: Main: 306286592 02:36:02 INFO - 2015-12-04 02:36:02,489 DEBUG : BROWSER_OUTPUT: 02:36:05 INFO - 2015-12-04 02:36:05,052 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51249/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 02:36:05 INFO - 2015-12-04 02:36:05,620 DEBUG : BROWSER_OUTPUT: RSS: Main: 306712576 02:36:05 INFO - 2015-12-04 02:36:05,621 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,337 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51249/tests/kraken/driver.html?testName=ai-astar) 02:36:07 INFO - 2015-12-04 02:36:07,594 DEBUG : BROWSER_OUTPUT: RSS: Main: 365330432 02:36:07 INFO - 2015-12-04 02:36:07,594 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,594 DEBUG : BROWSER_OUTPUT: __start_tp_report 02:36:07 INFO - 2015-12-04 02:36:07,594 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 02:36:07 INFO - 2015-12-04 02:36:07,594 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 02:36:07 INFO - 2015-12-04 02:36:07,594 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 02:36:07 INFO - 2015-12-04 02:36:07,595 DEBUG : BROWSER_OUTPUT: |0;ai-astar;106;111;102;108;108;109;98;107;95;108 02:36:07 INFO - 2015-12-04 02:36:07,595 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;153;130;162;150;125;148;127;157;150;126 02:36:07 INFO - 2015-12-04 02:36:07,595 DEBUG : BROWSER_OUTPUT: |2;audio-dft;160;161;162;162;161;161;163;163;163;172 02:36:07 INFO - 2015-12-04 02:36:07,595 DEBUG : BROWSER_OUTPUT: |3;audio-fft;80;76;84;120;66;69;68;69;116;64 02:36:07 INFO - 2015-12-04 02:36:07,595 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;100;100;135;88;90;90;132;89;89;133 02:36:07 INFO - 2015-12-04 02:36:07,595 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;120;114;120;120;120;120;115;120;114;114 02:36:07 INFO - 2015-12-04 02:36:07,595 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;124;124;124;124;124;124;124;124;124;124 02:36:07 INFO - 2015-12-04 02:36:07,595 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;99;100;100;100;101;102;99;100;102;100 02:36:07 INFO - 2015-12-04 02:36:07,596 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;59;64;62;62;61;62;62;71;57;56 02:36:07 INFO - 2015-12-04 02:36:07,596 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;65;65;65;69;67;66;66;67;66;67 02:36:07 INFO - 2015-12-04 02:36:07,596 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;81;84;82;83;80;81;81;82;82;86 02:36:07 INFO - 2015-12-04 02:36:07,596 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;125;128;122;118;121;119;123;129;119;127 02:36:07 INFO - 2015-12-04 02:36:07,596 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;145;145;139;146;145;144;145;146;142;144 02:36:07 INFO - 2015-12-04 02:36:07,596 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;70;69;68;69;68;69;68;71;68;68 02:36:07 INFO - 2015-12-04 02:36:07,596 DEBUG : BROWSER_OUTPUT: __end_tp_report 02:36:07 INFO - 2015-12-04 02:36:07,597 DEBUG : BROWSER_OUTPUT: __start_cc_report 02:36:07 INFO - 2015-12-04 02:36:07,597 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,893 02:36:07 INFO - 2015-12-04 02:36:07,597 DEBUG : BROWSER_OUTPUT: __end_cc_report 02:36:07 INFO - 2015-12-04 02:36:07,597 DEBUG : BROWSER_OUTPUT: __startTimestamp1449225367593__endTimestamp 02:36:07 INFO - 2015-12-04 02:36:07,597 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,597 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 02:36:07 INFO - 2015-12-04 02:36:07,597 DEBUG : BROWSER_OUTPUT: Number of tests: 14 02:36:07 INFO - 2015-12-04 02:36:07,598 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,599 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:105.20 Median:108.50 stddev:5.18 (4.8%) stddev-sans-first:5.49 02:36:07 INFO - 2015-12-04 02:36:07,599 DEBUG : BROWSER_OUTPUT: Values: 106.0 111.0 102.0 108.0 108.0 109.0 98.0 107.0 95.0 108.0 02:36:07 INFO - 2015-12-04 02:36:07,599 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,599 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:142.80 Median:150.00 stddev:14.21 (9.5%) stddev-sans-first:14.59 02:36:07 INFO - 2015-12-04 02:36:07,599 DEBUG : BROWSER_OUTPUT: Values: 153.0 130.0 162.0 150.0 125.0 148.0 127.0 157.0 150.0 126.0 02:36:07 INFO - 2015-12-04 02:36:07,600 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,600 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:162.80 Median:162.50 stddev:3.39 (2.1%) stddev-sans-first:3.44 02:36:07 INFO - 2015-12-04 02:36:07,600 DEBUG : BROWSER_OUTPUT: Values: 160.0 161.0 162.0 162.0 161.0 161.0 163.0 163.0 163.0 172.0 02:36:07 INFO - 2015-12-04 02:36:07,600 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,600 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:81.20 Median:69.00 stddev:20.42 (29.6%) stddev-sans-first:21.65 02:36:07 INFO - 2015-12-04 02:36:07,600 DEBUG : BROWSER_OUTPUT: Values: 80.0 76.0 84.0 120.0 66.0 69.0 68.0 69.0 116.0 64.0 02:36:07 INFO - 2015-12-04 02:36:07,601 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,601 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:104.60 Median:88.50 stddev:20.31 (22.9%) stddev-sans-first:21.47 02:36:07 INFO - 2015-12-04 02:36:07,601 DEBUG : BROWSER_OUTPUT: Values: 100.0 100.0 135.0 88.0 90.0 90.0 132.0 89.0 89.0 133.0 02:36:07 INFO - 2015-12-04 02:36:07,601 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,601 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:117.70 Median:120.00 stddev:2.98 (2.5%) stddev-sans-first:3.05 02:36:07 INFO - 2015-12-04 02:36:07,601 DEBUG : BROWSER_OUTPUT: Values: 120.0 114.0 120.0 120.0 120.0 120.0 115.0 120.0 114.0 114.0 02:36:07 INFO - 2015-12-04 02:36:07,601 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,602 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:124.00 Median:124.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 02:36:07 INFO - 2015-12-04 02:36:07,602 DEBUG : BROWSER_OUTPUT: Values: 124.0 124.0 124.0 124.0 124.0 124.0 124.0 124.0 124.0 124.0 02:36:07 INFO - 2015-12-04 02:36:07,602 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,602 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:100.30 Median:101.50 stddev:1.06 (1.0%) stddev-sans-first:1.01 02:36:07 INFO - 2015-12-04 02:36:07,602 DEBUG : BROWSER_OUTPUT: Values: 99.0 100.0 100.0 100.0 101.0 102.0 99.0 100.0 102.0 100.0 02:36:07 INFO - 2015-12-04 02:36:07,602 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,603 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:61.60 Median:62.00 stddev:4.14 (6.7%) stddev-sans-first:4.28 02:36:07 INFO - 2015-12-04 02:36:07,603 DEBUG : BROWSER_OUTPUT: Values: 59.0 64.0 62.0 62.0 61.0 62.0 62.0 71.0 57.0 56.0 02:36:07 INFO - 2015-12-04 02:36:07,603 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,603 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:66.30 Median:66.50 stddev:1.25 (1.9%) stddev-sans-first:1.24 02:36:07 INFO - 2015-12-04 02:36:07,603 DEBUG : BROWSER_OUTPUT: Values: 65.0 65.0 65.0 69.0 67.0 66.0 66.0 67.0 66.0 67.0 02:36:07 INFO - 2015-12-04 02:36:07,604 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,604 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:82.20 Median:82.00 stddev:1.75 (2.1%) stddev-sans-first:1.80 02:36:07 INFO - 2015-12-04 02:36:07,605 DEBUG : BROWSER_OUTPUT: Values: 81.0 84.0 82.0 83.0 80.0 81.0 81.0 82.0 82.0 86.0 02:36:07 INFO - 2015-12-04 02:36:07,605 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,605 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:123.10 Median:124.00 stddev:3.98 (3.2%) stddev-sans-first:4.17 02:36:07 INFO - 2015-12-04 02:36:07,605 DEBUG : BROWSER_OUTPUT: Values: 125.0 128.0 122.0 118.0 121.0 119.0 123.0 129.0 119.0 127.0 02:36:07 INFO - 2015-12-04 02:36:07,605 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,606 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:144.10 Median:145.00 stddev:2.13 (1.5%) stddev-sans-first:2.24 02:36:07 INFO - 2015-12-04 02:36:07,606 DEBUG : BROWSER_OUTPUT: Values: 145.0 145.0 139.0 146.0 145.0 144.0 145.0 146.0 142.0 144.0 02:36:07 INFO - 2015-12-04 02:36:07,606 DEBUG : BROWSER_OUTPUT: 02:36:07 INFO - 2015-12-04 02:36:07,606 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.80 Median:69.00 stddev:1.03 (1.5%) stddev-sans-first:1.00 02:36:07 INFO - 2015-12-04 02:36:07,606 DEBUG : BROWSER_OUTPUT: Values: 70.0 69.0 68.0 69.0 68.0 69.0 68.0 71.0 68.0 68.0 02:36:07 INFO - 2015-12-04 02:36:07,606 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 02:36:07 INFO - 2015-12-04 02:36:07,606 DEBUG : BROWSER_OUTPUT: 02:36:08 INFO - 2015-12-04 02:36:08,189 INFO : Browser exited with error code: 0 02:36:08 INFO - 2015-12-04 02:36:08,237 INFO : Completed test kraken (00:00:56) 02:36:08 INFO - 2015-12-04 02:36:08,237 INFO : Starting test v8_7 02:36:08 INFO - 2015-12-04 02:36:08,237 DEBUG : operating with platform_type : mac_ 02:36:08 INFO - 2015-12-04 02:36:08,237 INFO : Initialising browser for v8_7 test... 02:36:08 INFO - 2015-12-04 02:36:08,252 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/tmp6dVNlN/profile http://localhost:51249/getInfo.html 02:36:10 INFO - 2015-12-04 02:36:10,329 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 02:36:10 INFO - 2015-12-04 02:36:10,330 DEBUG : BROWSER_OUTPUT: colorDepth:24 02:36:10 INFO - 2015-12-04 02:36:10,330 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 02:36:10 INFO - 2015-12-04 02:36:10,330 DEBUG : BROWSER_OUTPUT: __metrics 02:36:10 INFO - 2015-12-04 02:36:10,339 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 02:36:10 INFO - 2015-12-04 02:36:10,912 INFO : Browser initialized. 02:36:10 INFO - 2015-12-04 02:36:10,912 INFO : Running cycle 1/1 for v8_7 test... 02:36:10 INFO - 2015-12-04 02:36:10,913 DEBUG : command line: /builds/slave/test/build/application/FirefoxDeveloperEdition.app/Contents/MacOS/firefox -foreground -profile /var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/T/tmp6dVNlN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 02:36:22 INFO - 2015-12-04 02:36:22,695 DEBUG : BROWSER_OUTPUT: RSS: Main: 199380992 02:36:22 INFO - 2015-12-04 02:36:22,695 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,112 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51249/tests/v8_7/run.html (next: http://localhost:51249/tests/v8_7/run.html) 02:36:44 INFO - 2015-12-04 02:36:44,366 DEBUG : BROWSER_OUTPUT: RSS: Main: 516911104 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: __start_tp_report 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: |0;Richards;166.08536787908986 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;183.58729575913347 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: |2;Encrypt;320.5128205128205 02:36:44 INFO - 2015-12-04 02:36:44,367 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5737.142857142857 02:36:44 INFO - 2015-12-04 02:36:44,368 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1022.4948875255624 02:36:44 INFO - 2015-12-04 02:36:44,368 DEBUG : BROWSER_OUTPUT: |5;Earley;663.1299734748011 02:36:44 INFO - 2015-12-04 02:36:44,368 DEBUG : BROWSER_OUTPUT: |6;Boyer;12132.530120481928 02:36:44 INFO - 2015-12-04 02:36:44,368 DEBUG : BROWSER_OUTPUT: |7;RegExp;29285.714285714286 02:36:44 INFO - 2015-12-04 02:36:44,368 DEBUG : BROWSER_OUTPUT: |8;Splay;584.1121495327103 02:36:44 INFO - 2015-12-04 02:36:44,368 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;5797.687861271676 02:36:44 INFO - 2015-12-04 02:36:44,368 DEBUG : BROWSER_OUTPUT: __end_tp_report 02:36:44 INFO - 2015-12-04 02:36:44,368 DEBUG : BROWSER_OUTPUT: __startTimestamp1449225404363__endTimestamp 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: Number of tests: 10 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:166.09 Median:166.09 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: Values: 166.1 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:183.59 Median:183.59 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,369 DEBUG : BROWSER_OUTPUT: Values: 183.6 02:36:44 INFO - 2015-12-04 02:36:44,370 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,370 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:320.51 Median:320.51 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,370 DEBUG : BROWSER_OUTPUT: Values: 320.5 02:36:44 INFO - 2015-12-04 02:36:44,370 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,370 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5737.14 Median:5737.14 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,370 DEBUG : BROWSER_OUTPUT: Values: 5737.1 02:36:44 INFO - 2015-12-04 02:36:44,370 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1022.49 Median:1022.49 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: Values: 1022.5 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:663.13 Median:663.13 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: Values: 663.1 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12132.53 Median:12132.53 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: Values: 12132.5 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:29285.71 Median:29285.71 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: Values: 29285.7 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:584.11 Median:584.11 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,371 DEBUG : BROWSER_OUTPUT: Values: 584.1 02:36:44 INFO - 2015-12-04 02:36:44,372 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,372 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:5797.69 Median:5797.69 stddev:0.00 (0.0%) 02:36:44 INFO - 2015-12-04 02:36:44,372 DEBUG : BROWSER_OUTPUT: Values: 5797.7 02:36:44 INFO - 2015-12-04 02:36:44,372 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 02:36:44 INFO - 2015-12-04 02:36:44,372 DEBUG : BROWSER_OUTPUT: 02:36:44 INFO - 2015-12-04 02:36:44,974 INFO : Browser exited with error code: 0 02:36:45 INFO - 2015-12-04 02:36:45,000 INFO : Completed test v8_7 (00:00:36) 02:36:45 INFO - 2015-12-04 02:36:45,052 INFO : Completed test suite (00:20:06) 02:36:45 INFO - 2015-12-04 02:36:45,052 DEBUG : Working with test: dromaeo_css 02:36:45 INFO - 2015-12-04 02:36:45,052 DEBUG : Generating results file: dromaeo_css 02:36:45 INFO - 2015-12-04 02:36:45,053 DEBUG : Working with test: kraken 02:36:45 INFO - 2015-12-04 02:36:45,053 DEBUG : Generating results file: kraken 02:36:45 INFO - 2015-12-04 02:36:45,053 INFO : javascript benchmark 02:36:45 INFO - 2015-12-04 02:36:45,053 DEBUG : Working with test: v8_7 02:36:45 INFO - 2015-12-04 02:36:45,054 DEBUG : Generating results file: v8_7 02:36:45 INFO - 2015-12-04 02:36:45,054 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 02:36:45 INFO - 2015-12-04 02:36:45,210 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,52,55]] 02:36:45 INFO - 2015-12-04 02:36:45,210 DEBUG : process_Request line: dromaeo_css 6663.81 graph.html#tests=[[72,52,55]] 02:36:45 INFO - 2015-12-04 02:36:45,210 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 02:36:45 INFO - 2015-12-04 02:36:45,339 DEBUG : process_Request line: kraken 1484.70 graph.html#tests=[[232,52,55]] 02:36:45 INFO - 2015-12-04 02:36:45,339 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 02:36:45 INFO - 2015-12-04 02:36:45,473 DEBUG : process_Request line: v8_7 20589.03 graph.html#tests=[[230,52,55]] 02:36:45 INFO - 2015-12-04 02:36:45,474 INFO : javascript benchmark 02:36:45 INFO - 2015-12-04 02:36:45,476 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [362.11824208053395, 363.1810267846009, 365.0945654776155, 365.1364522903331, 369.2835898357186, 15122.24388780562, 15336.61658458539, 17821.198046087924, 18999.145038473267, 19847.20611175553, 14811.851881481181, 14815.407383704665, 15411.76882346763, 17062.976221426725, 18195.818041819577, 5526.253955715977, 5555.527780138673, 5665.348484924245, 5666.235058267122, 5705.65766054036, 4199.979000104995, 4317.071829556645, 5594.188842617838, 5627.324721033461, 5982.012967860298, 6069.0592958091565, 6090.26916769986, 6117.480014198798, 6121.785737499188, 6123.632582045091, 4725.456572494173, 4812.013537224861, 4825.686330388514, 4830.0, 6060.1212824140475, 3984.880453586397, 4069.918601627951, 4071.043304823364, 4074.4295798588223, 4084.6323830855067, 12068.0, 13212.471501139942, 13449.394777235048, 13475.258860762655, 13492.460301587924, 1908.9331873384365, 1926.1524929031182, 1956.158851693771, 2003.6994450832347, 2101.873887566751, 9816.950915245377, 9880.851787223197, 9934.602615895355, 10239.795204095877, 10241.0, 1618.1504710027211, 1631.8776091793163, 1638.6476907464832, 1662.9002259864446, 1664.5172899859026, 60080.399196007915, 61805.69097154531, 61825.38174618286, 61863.6906815472, 62276.0, 6364.1408409865, 6464.967675161594, 6508.414242718178, 6516.446102081376, 6529.902051469232, 7404.148522919933, 7430.071241094864, 7434.1822399536, 7437.107547094383, 7439.8140046499275, 5705.5150312223095, 5741.598088133874, 5754.971225143848, 5770.278715160605, 5772.884542309214, 6335.746570137143, 6346.238451385863, 6349.555531112777, 6376.139221205078, 6389.2652344980925, 3033.8179709217516, 3042.406730687539, 3052.5421186822155, 3066.23344163959, 3069.5395690646583, 1031.1338475680313, 1039.1219419590434, 1075.7740874416304, 1109.1071687291808, 1124.6401151631562, 421.50052188157133, 433.92840181370354, 441.05834044315617, 445.29420867924057, 452.8822506148425, 11661.825072623917, 11888.524459021715, 12277.263364198177, 12292.446839892227, 12307.20003199807, 417.60744899794093, 417.8391319342014, 419.93700944857903, 428.44944246642916, 462.13349968808484, 6370.235571731422, 6473.385028422293, 6575.835604109936, 6592.406683398517, 6635.8009259722285, 566492.0, 578073.0, 581748.0, 588256.0, 591422.0, 65313.67343163254, 71617.64191179011, 73190.63404683048, 73965.2603473969, 75498.24501755022, 422.6323098903973, 431.8833914842975, 467.7824811462686, 483.66868694944077, 484.27842514653616, 11291.491882865455, 11380.146489013192, 11468.713282168013, 11711.941440292743, 11714.765704685688, 35283.0, 35654.821725891205, 35798.4630230552, 36331.0, 36784.632153679195, 47417.05165896732, 47614.523854761006, 47785.28322075241, 48288.0, 48307.75846120747, 6281.371862813682, 6323.177986861862, 6327.905081423874, 6339.619622822645, 6339.746410143543, 12198.57304994321, 12285.201461904948, 12296.139270250997, 12354.196977196454, 12436.005119590593, 10606.840897386699, 10658.840117398091, 10784.946075269887, 10786.685325869401, 10830.729231769268, 9915.702528924145, 9927.950360248153, 9980.900190998287, 10071.949640251752, 10444.373337599769, 9145.0, 10559.15526757873, 10631.840522392326, 10705.250632455653, 10934.507947142238, 5783.884322313615, 5955.553333500092, 6153.661548614869, 6274.529410294337, 6343.270523889812, 10627.36235825853, 10708.57165713394, 10724.195685323475, 10815.242932994615, 10920.235583509397], "dojo.html": [3138.356636889438, 3257.2182676157713, 3263.135269153674, 3280.278338765471, 3295.769296149269, 5355.277037599923, 5426.837194884155, 5430.647007944486, 5449.64577302475, 5461.563074954004, 5345.893082138355, 5540.307461567304, 5540.889182216363, 5557.77768889245, 5577.944220557793, 4977.303177555145, 4987.650864439491, 5060.1650727630085, 5080.84757457275, 5106.259592359124, 4852.2479015752615, 4940.431850337203, 5013.373328333958, 5038.949610503903, 5043.949560504403, 5118.488151184889, 5139.922901156467, 5146.562542183919, 5147.48525147486, 5180.222966555009, 4797.280407938802, 4911.926321105187, 5076.74616269185, 5113.744312784346, 5119.36007999002, 4912.803487860481, 5005.599552035865, 5006.924896126561, 5029.119904016819, 5046.09170349337, 5312.282841816383, 5487.204355368449, 5498.917516237259, 5516.613837031409, 5552.416996215379, 5518.862028449281, 5666.320041594994, 5674.801381951612, 5867.237259156325, 5909.9704501477645, 5720.1991721159075, 5816.941830581683, 5831.562632802556, 5833.0, 5837.620554663976, 5529.142982837667, 5560.555155587503, 5583.441655834466, 5587.413321601254, 5588.329400471888, 5455.699936503531, 5549.5837812164245, 5860.970695146582, 6067.939320606825, 6075.969620151871, 5719.2279042328755, 5730.054541000688, 5733.455321744427, 5740.454656807597, 5808.186853840466, 5863.442972917566, 5863.618864773862, 5865.824025279248, 5881.794137205177, 5887.264091988502, 5640.097584386478, 5655.179998900218, 5773.769049237983, 5784.537237021028, 5785.681787501644, 5648.661080335193, 5807.186993820868, 5820.621659592113, 5825.0679891217205, 5848.181254624356, 4528.207563676344, 4529.592336689714, 4534.115847409789, 4538.183127037165, 4568.794404251817, 3853.4412510185866, 3942.1130245695063, 3952.466417033721, 4068.7762173080764, 4136.31750761127, 5456.454354564512, 5476.17857321397, 5478.013957487611, 5492.286002819608, 5492.286002819608, 5919.0, 5924.5852790305125, 5935.376785437553, 5935.904961843498, 5937.495312898365, 5242.423333433319, 5328.973355133277, 5338.225957236179, 5352.705601191894, 5440.6735595864375, 5177.58579313654, 5244.842654720364, 5245.1345527988215, 5260.105782017066, 5272.077386457355, 6018.21763170785, 6032.215811944331, 6036.879262414815, 6040.2751669798145, 6045.123457098696, 5650.660960342392, 5740.13897915316, 5769.711514424346, 5779.971100144472, 5850.5904586678525, 5885.823425297248, 5955.285365756137, 5956.910646340395, 5965.6718880461995, 5984.102384642339, 5817.301923769175, 5822.912656310244, 5826.563007774349, 5840.853978650398, 5852.678102704393, 5636.098224284095, 5759.2512973313205, 5775.8556036099435, 5824.970875145597, 5934.020886553671, 5810.418958104325, 5821.417858214145, 5824.184614153937, 5826.70866456684, 5837.912431313619, 5818.50542703858, 5823.155642431739, 5827.8834423310445, 5830.737616807169, 5838.795642152504, 5396.163594642837, 5418.295621569171, 5528.530074943675, 5532.585056120887, 5550.666959982414, 5763.7406316715005, 5808.419158084158, 5811.128330750421, 5815.738291776795, 5825.242718446575, 5706.828795136153, 5713.114467257582, 5718.027935250934, 5722.0272553665145, 5722.2561067061015], "mootools.html": [961.6874515782373, 1748.659011492759, 1824.232958939789, 1828.5154434074973, 1833.9633207335853, 6801.863962720742, 7075.85848283034, 7237.31245531675, 7253.891191632129, 7264.418846492281, 7227.385672217868, 7383.187849336582, 7404.7778566642955, 7426.034615499977, 7428.777136685908, 2217.7782221777775, 2231.665250212465, 2233.486298151426, 2234.452559123009, 2234.54191890662, 2221.1559607349263, 2248.0895237428867, 2251.0770584060538, 2251.549690061986, 2254.1546919905036, 2165.9133634654595, 2191.8465707400487, 2233.7877901599404, 2246.3485589179118, 2249.3701763506247, 2149.6453085241073, 2175.3582693105573, 2179.18280644759, 2181.1275489804048, 2181.1602533024898, 2240.630296001158, 2250.0437314141586, 2250.1674380479326, 2253.211376018397, 2255.853369530975, 6632.701528431232, 6847.691853866588, 7289.70841166358, 7334.779956601311, 7349.889751653729, 4478.440194975628, 4590.495045544987, 4602.309653551961, 4605.470370907355, 4607.14767767964, 2836.248394175545, 2878.194105650421, 2914.446255211503, 2919.5328747400313, 2929.868155932988, 838.8993320801543, 839.2530647723531, 848.8811566380712, 858.7767180533044, 892.3307519360479, 9377.953110234474, 9492.905070949271, 9508.524573771352, 9534.427934323894, 9540.522973851279, 4071.5114186297833, 4094.160697057096, 4130.545639979599, 4135.441715368447, 4200.033992181815, 8466.068732439428, 8466.915330846612, 8475.618597163142, 8479.279261262862, 8492.617832197566, 4704.506026867198, 4710.481846996828, 4711.199096153662, 4712.670113092051, 4713.67004309695, 4295.570442955679, 4296.806643701041, 4301.333293339538, 4306.65546756265, 4307.966088138886, 3340.331933613287, 3350.0787283497234, 3352.027911905569, 3364.7308215342714, 3390.304987477561, 1053.1469509697017, 1057.6826951914395, 1059.7032830807386, 1063.2291588598205, 1065.7016035509914, 1062.7874425115008, 1076.1982323169132, 1077.3751224289892, 1198.7123090458226, 1328.6014195741238, 6817.897731534031, 6847.520673552804, 6862.794116176523, 6871.6564171791215, 6896.517243792886, 432.3126229295435, 437.7132977899481, 439.7845055922575, 440.2515723270453, 442.104737905737, 5277.736113194325, 5505.889882202334, 5543.722813859291, 5544.972275138599, 5557.36090349615, 7913.723019694283, 8176.672933082729, 8377.287930525974, 8377.37169712274, 8382.455140415854, 8143.837123257502, 8308.335333173332, 8314.459560128693, 8334.12491688376, 8342.416030877901, 6881.965590172117, 6938.826529336807, 6966.79099627012, 6972.895406569007, 6973.093497845349, 6723.596584204964, 6783.762568310085, 6785.93214067853, 6786.355296246848, 6795.320467953363, 7659.387249020177, 7774.455788094779, 7834.0599128105, 7835.5690437026515, 7840.764777056697, 7950.840983180188, 7957.7612671619945, 7966.92033079685, 7968.402369822171, 7988.041435027834, 6272.121902933502, 6443.806685799434, 6535.836604084746, 6538.117354157128, 6562.048502967138, 7023.894641580483, 7081.575105493687, 7094.396976257076, 7099.716011359487, 7101.325374089453, 6536.7712130075215, 6649.700763465752, 6663.933360666331, 6732.831679208059, 6749.42629876466, 6553.541252112306, 6557.770478033246, 6604.471642268511, 6619.3380661933425, 6639.634820084942, 6658.7336506539195, 6704.195496540251, 6722.563033402813, 6734.09089772894, 6738.528303018742, 6146.969265153645, 6173.660448675187, 6182.598131121463, 6188.721507532082, 6194.535409844189, 6248.781292654735, 6260.436560709376, 6283.968580157253, 6285.465735412541, 6294.968525157345], "ext.html": [563.8674911395822, 596.9343372229055, 606.6087373643996, 607.9878402431953, 615.5844804756788, 32234.194145146383, 39081.0, 39319.80340098303, 39408.2118357633, 39463.40804887929, 41728.0, 42164.0, 42228.36657450141, 42274.15451690972, 42308.36537451933, 8739.868901966443, 8883.73348799537, 9346.06539346065, 9506.049395060472, 9515.429074255531, 10937.289076210021, 11145.665630031112, 11175.44122793861, 11210.66368008957, 11243.550257989671, 11123.0, 11234.49444774987, 11266.211365204439, 11312.490937907773, 11322.433878306092, 8938.016818149998, 9106.453612783254, 11096.611618593352, 11200.327980321166, 11348.432578371048, 11047.558097676083, 11172.273802202912, 11199.768025517267, 11201.551937922555, 11234.0, 38954.41568376477, 39309.80345098256, 39321.606783932366, 39382.803085984386, 39392.0, 3114.5639610454555, 3232.5474433579316, 3520.5951315598777, 3658.6937343259224, 3695.7043436525014, 26913.730862691318, 27148.45703085947, 27295.72704272952, 27608.309792255353, 27622.723772762216, 2425.745296743834, 2466.136852101768, 2486.4405508760565, 2496.0764517128596, 2600.9089681861046, 267221.0, 267599.6620016907, 270573.0, 271006.0, 271645.0, 52843.0, 53777.31113444312, 65557.34442655512, 66612.33387666158, 66663.66668166628, 59593.0, 60021.69989150026, 60071.49463790233, 60122.098168527504, 60162.0, 17742.0, 18028.36900708469, 18208.271669133086, 18224.726629100573, 18240.361587344378, 13820.239886806121, 13848.930755346159, 14009.929950350182, 14083.084599501, 14149.221792801289, 19227.423177304703, 19366.806331936783, 19604.803951960585, 19643.803561964483, 19666.70499942502, 8698.695545655872, 8796.067569927864, 8833.0, 8905.33210009239, 8936.24041956441, 974.3910056214866, 981.6613268422383, 998.121652945418, 1047.157038583932, 1120.0143873391364, 27913.30216744557, 28202.43595128086, 28351.29121771931, 28640.71359286422, 28658.713412866022, 1044.3420644993605, 1105.3147048829776, 1123.477582923928, 1137.726945533066, 1219.4699463017566, 13798.586042418743, 14508.709825803426, 14646.560603181708, 14801.185934773475, 14878.181700006604, 224186.0, 227068.0, 227611.0, 227626.0, 228146.0, 47133.0, 47899.281510777364, 47989.0, 50106.49893501091, 50228.24657630138, 1454.1711224602086, 1477.062065588359, 1479.5191562742152, 1490.180400779567, 1491.5525342397239, 26126.86936565305, 29536.409271814875, 29706.851465742533, 29795.255118622208, 30200.0, 43543.12913741771, 44185.779071104436, 45802.0, 48625.270620941425, 49628.0, 264049.0, 266736.0, 269339.0, 269727.0, 270573.0, 31984.68015319817, 32095.0, 32670.83664581662, 32903.506447402826, 33320.833395832866, 41642.0, 42246.78876605597, 42490.57509424866, 43818.56181438145, 43990.780046099564, 35104.82447587848, 36825.44761828521, 36910.8154459226, 37228.25543489061, 37646.435303471015, 35075.47386789251, 35960.51253926289, 36215.45676814902, 36408.0, 36456.0, 33708.157296067795, 34213.0, 34475.0, 34479.44842482044, 34481.31037379288, 26271.737282626927, 26633.733662663126, 32042.19894502563, 32272.193195170308, 32290.35419291648, 24661.87669061643, 24913.750862491142, 25075.373115672253, 25173.49653006893, 25372.0], "prototype.html": [302.5703501028539, 312.5390049676727, 316.80041573808495, 321.826213844524, 325.29735770735215, 6128.816135515942, 6180.59826111303, 6282.403171698693, 6298.937010629898, 6319.620822750632, 6159.753609855612, 6166.599171053889, 6246.968765156168, 6250.9062364064575, 6258.030005349178, 4728.078024785168, 4734.266188740742, 4737.147313483571, 4745.738984355877, 4756.310335001423, 4591.0, 4653.930191047137, 4678.555537223959, 4750.453697824742, 4758.857234282959, 4672.462666793312, 4703.223968045286, 4709.623230141598, 4729.550692684206, 4737.099951009314, 4698.130845793522, 4709.411323584552, 4710.999999999983, 4712.976435117803, 4718.622510199176, 4076.653484453825, 4077.429159917614, 4078.714489985702, 4078.9802549362657, 4086.080631857838, 5838.795642152547, 6017.518598512109, 6069.57512974092, 6101.694915254219, 6108.633481991051, 5388.407275199725, 5389.137737961946, 5396.568274538027, 5407.161889907032, 5414.729263536808, 6551.3121122281955, 6564.770233041869, 6566.047923051178, 6569.310222426672, 6573.441257493118, 4272.829086836523, 4343.283358245885, 4473.239549276631, 4475.373447717322, 4479.70881892676, 6611.702473388709, 6730.461563074991, 6776.15298087739, 6841.3842754151865, 6857.519973601849, 4319.373690814814, 4350.630196433339, 4354.586314300136, 4355.477342718894, 4373.169097871394, 4451.955480445219, 4453.910921781546, 4458.398116254329, 4460.0633866887665, 4461.732296062247, 5104.055749686246, 5231.686098834082, 5245.108331583564, 5245.26566280721, 5271.20931860224, 6643.435307998778, 6644.0, 6647.833804154935, 6660.733570657217, 6678.298778628271, 1597.8961367511074, 1618.6438983423627, 1619.5141457562684, 1619.9757003644954, 1621.9295265125197, 994.721477986165, 1015.1320620869051, 1018.6129270877168, 1018.9439580822977, 1022.3916769522123, 6292.0, 6292.119103325538, 6296.590721603081, 6303.180586523723, 6315.684215789192, 6907.378335949788, 6917.273686262971, 6918.515703900679, 6935.445164386837, 6950.096487456598, 6103.969480152571, 6293.339199383999, 6295.527835412362, 6306.747730090837, 6310.0, 3768.0, 3812.733108682421, 3815.275097731422, 3825.5983121771815, 3836.55879573847, 6968.268331825187, 6988.825279368057, 6995.510314278054, 7003.3346832050875, 7017.508774385744, 6956.5478243913985, 7071.858562828715, 7077.469189810785, 7085.0435191248525, 7089.14930208368, 6940.0, 6950.513464057569, 6951.061606683134, 6959.6868140933775, 6965.303469653197, 6861.4853885957755, 6866.690998904961, 6885.793426197222, 6898.482613803884, 6910.654467276516, 6592.76925307612, 6616.305287944697, 6704.296048914794, 6715.127033485615, 6724.092247546519, 6891.965540172468, 6900.7929762107215, 6962.686679099554, 6986.9650651746415, 7003.1596208453275, 4205.894852628709, 4257.0, 4262.531121576686, 4262.55243199472, 4264.701470897007, 6653.401193892573, 6800.217974932748, 6835.4189893859575, 6841.076454678754, 6842.076319696777, 6627.403533681992, 6641.402273795188, 6662.367075127855, 6686.498512611671, 6743.325667433413, 6728.428083612752, 6734.6295953721055, 6735.966320168368, 6740.191177058784, 6742.69657865407, 6365.586236894587, 6565.0, 6565.540412171103, 6578.868422631616, 6603.20761508622, 6741.494387920828, 6754.696038678173, 6756.864862702817, 6763.053172555945, 6773.729050838108, 6557.573757705733, 6581.572197807127, 6587.0448784926875, 6600.702968366531, 6605.1083103780375], "yui.html": [721.1490441279288, 741.3661319571765, 778.8487362358629, 801.3669201330947, 804.091376744279, 13890.30548472576, 14268.785968210484, 14300.4994825181, 14317.284135793208, 14324.713505729878, 14720.484783032596, 14866.55400337989, 14914.552563423087, 14925.477608283685, 14936.775948360782, 726.3354031061573, 736.8857827036818, 898.0166717444404, 900.0369604523163, 912.0378001208722, 894.552723638181, 895.2524641923969, 899.029048627484, 910.804177101923, 910.9498977556232, 947.0766003146911, 956.7273327101777, 956.7560272130597, 957.195955397466, 957.5978089202517, 757.9393648508106, 764.747633281016, 931.8602209668536, 948.5494390164652, 951.4434056077204, 690.3338278561213, 692.594832023267, 692.8094773937157, 693.012457248424, 694.0768777525878, 14335.56993290203, 14519.419223231058, 14522.346494407777, 14523.854761452461, 14530.782038269434, 9628.47043412612, 9678.128968392879, 9885.950570247174, 9941.502924853728, 10544.0, 8641.611127499214, 9187.219086377667, 9437.669681561112, 9819.754506137333, 9977.650782222587, 2957.896473623413, 3065.70875766804, 3148.323110531224, 3169.7464202863716, 3185.9964111304866, 48253.0, 49634.0, 49773.0, 49865.25202121971, 49927.00145997096, 7234.819129521698, 7272.709091636381, 7284.380827629605, 7296.233895440902, 7315.085614298213, 12090.637280881587, 12095.334756588472, 12103.515859365527, 12110.091743119301, 12125.878741212475, 6476.287608363076, 6503.804885853432, 6644.900326495106, 6699.665016749143, 6734.494912881553, 3889.2999260132883, 3931.2161670890823, 3942.40863870416, 4007.479027726377, 4037.4953130858644, 2835.7873159512706, 2871.224769312316, 2875.1087162979125, 2876.5109931311727, 2881.1212580162833, 422.54576330444894, 428.64208385997415, 430.0860671073968, 431.09470112763574, 478.1417355846264, 464.6863367227108, 576.7058800012024, 601.7502736364447, 612.3294991983771, 651.4267444648774, 8290.958545207235, 8413.242808147295, 8542.40203185771, 8565.143485651384, 8588.957055214683, 516.6951498615834, 534.7727215933213, 560.7897038610521, 570.6205373426708, 639.1754636518839, 3709.2581483703366, 4013.3779264214095, 4113.136241389282, 4116.197341518435, 4325.740455572675, 60511.0, 60945.695271524244, 61138.38861611327, 61535.38464615386, 61549.69225153846, 52436.0, 54041.0, 54144.729276354155, 55019.17471237935, 55225.0, 53151.20273195905, 54028.45971540313, 54184.45815541794, 54668.90662186734, 54846.0, 8599.097094805205, 8684.956575217084, 8808.559572021246, 8925.642974281216, 8993.350581762188, 37163.44254836126, 37384.252314954094, 37709.24581508409, 38157.2368552633, 38390.616093839824, 46236.0, 46390.76804615955, 46464.767676161406, 47109.52890471051, 47297.29054064123, 10635.787284254426, 11106.055985241022, 11288.153388496059, 11564.363959981945, 11756.23584467007, 11332.206745527734, 11393.943030285127, 11434.599789007345, 11707.414629268673, 12077.0, 10656.946715266684, 11018.614348497764, 11084.667459976214, 11101.333919964505, 11161.162912781736, 10398.844017339594, 10995.615153469591, 11029.503672334604, 11078.446077695922, 11264.83102753443, 10839.241253112206, 10883.401412922365, 10921.83617245726, 10966.506507207036, 10980.176486763365, 9281.303902207226, 9342.95328523353, 9496.382735122195, 9627.855582166134, 9708.368956017835, 9570.425774453555, 9872.85190722154, 9903.78524507572, 9910.950445247727, 9974.052465015811]}, "summary": {"suite": 6663.810675214572, "subtests": {"jquery.html": {"filtered": 6929.634467630845, "value": 6929.634467630845}, "dojo.html": {"filtered": 5399.057647106008, "value": 5399.057647106008}, "mootools.html": {"filtered": 4150.976999701161, "value": 4150.976999701161}, "ext.html": {"filtered": 18750.96656998006, "value": 18750.96656998006}, "prototype.html": {"filtered": 4908.490248034644, "value": 4908.490248034644}, "yui.html": {"filtered": 6125.569316532549, "value": 6125.569316532549}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0050"}, "testrun": {"date": 1449224198, "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": "44.0a2", "id": "20151204004006", "branch": "Mozilla-Aurora", "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0"}}, {"talos_counters": {}, "results": {"audio-dft": [160.0, 161.0, 162.0, 162.0, 161.0, 161.0, 163.0, 163.0, 163.0, 172.0], "ai-astar": [106.0, 111.0, 102.0, 108.0, 108.0, 109.0, 98.0, 107.0, 95.0, 108.0], "imaging-gaussian-blur": [120.0, 114.0, 120.0, 120.0, 120.0, 120.0, 115.0, 120.0, 114.0, 114.0], "audio-beat-detection": [153.0, 130.0, 162.0, 150.0, 125.0, 148.0, 127.0, 157.0, 150.0, 126.0], "json-stringify-tinderbox": [65.0, 65.0, 65.0, 69.0, 67.0, 66.0, 66.0, 67.0, 66.0, 67.0], "stanford-crypto-pbkdf2": [145.0, 145.0, 139.0, 146.0, 145.0, 144.0, 145.0, 146.0, 142.0, 144.0], "json-parse-financial": [59.0, 64.0, 62.0, 62.0, 61.0, 62.0, 62.0, 71.0, 57.0, 56.0], "stanford-crypto-sha256-iterative": [70.0, 69.0, 68.0, 69.0, 68.0, 69.0, 68.0, 71.0, 68.0, 68.0], "audio-fft": [80.0, 76.0, 84.0, 120.0, 66.0, 69.0, 68.0, 69.0, 116.0, 64.0], "imaging-darkroom": [124.0, 124.0, 124.0, 124.0, 124.0, 124.0, 124.0, 124.0, 124.0, 124.0], "stanford-crypto-ccm": [125.0, 128.0, 122.0, 118.0, 121.0, 119.0, 123.0, 129.0, 119.0, 127.0], "audio-oscillator": [100.0, 100.0, 135.0, 88.0, 90.0, 90.0, 132.0, 89.0, 89.0, 133.0], "stanford-crypto-aes": [81.0, 84.0, 82.0, 83.0, 80.0, 81.0, 81.0, 82.0, 82.0, 86.0], "imaging-desaturate": [99.0, 100.0, 100.0, 100.0, 101.0, 102.0, 99.0, 100.0, 102.0, 100.0]}, "summary": {"suite": 1484.6999999999998, "subtests": {"audio-fft": {"filtered": 81.2, "value": 81.2}, "stanford-crypto-pbkdf2": {"filtered": 144.1, "value": 144.1}, "audio-beat-detection": {"filtered": 142.8, "value": 142.8}, "stanford-crypto-ccm": {"filtered": 123.1, "value": 123.1}, "imaging-darkroom": {"filtered": 124.0, "value": 124.0}, "json-parse-financial": {"filtered": 61.6, "value": 61.6}, "audio-oscillator": {"filtered": 104.6, "value": 104.6}, "ai-astar": {"filtered": 105.2, "value": 105.2}, "audio-dft": {"filtered": 162.8, "value": 162.8}, "stanford-crypto-sha256-iterative": {"filtered": 68.8, "value": 68.8}, "json-stringify-tinderbox": {"filtered": 66.3, "value": 66.3}, "imaging-gaussian-blur": {"filtered": 117.7, "value": 117.7}, "stanford-crypto-aes": {"filtered": 82.2, "value": 82.2}, "imaging-desaturate": {"filtered": 100.3, "value": 100.3}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0050"}, "testrun": {"date": 1449224198, "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": "44.0a2", "id": "20151204004006", "branch": "Mozilla-Aurora", "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0"}}, {"talos_counters": {}, "results": {"DeltaBlue": [183.58729575913347], "Encrypt": [320.5128205128205], "NavierStokes": [5797.687861271676], "Decrypt": [5737.142857142857], "Splay": [584.1121495327103], "Richards": [166.08536787908986], "RegExp": [29285.714285714286], "Earley": [663.1299734748011], "Boyer": [12132.530120481928], "RayTrace": [1022.4948875255624]}, "summary": {"suite": 20589.033253427922, "subtests": {"DeltaBlue": {"filtered": 360.144746, "value": 360.144746}, "Encrypt": {"filtered": 830.48472, "value": 830.48472}, "NavierStokes": {"filtered": 255.96410767696923, "value": 255.96410767696923}, "Decrypt": {"filtered": 46.3960906374502, "value": 46.3960906374502}, "Splay": {"filtered": 139.51259200000004, "value": 139.51259200000004}, "RegExp": {"filtered": 31.10680487804877, "value": 31.10680487804877}, "Richards": {"filtered": 212.55334200000007, "value": 212.55334200000007}, "Earley": {"filtered": 1005.0262039999998, "value": 1005.0262039999998}, "Boyer": {"filtered": 54.93190566037737, "value": 54.93190566037737}, "RayTrace": {"filtered": 723.7092419999998, "value": 723.7092419999998}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0050"}, "testrun": {"date": 1449224198, "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": "44.0a2", "id": "20151204004006", "branch": "Mozilla-Aurora", "revision": "858b1b930b16a5c46634e3dad2650c517e150cb0"}}] 02:36:45 INFO - RETURN: dromaeo_css: 6663.81 02:36:45 INFO - RETURN: kraken: 1484.70 02:36:45 INFO - RETURN: v8_7: 20589.03 02:36:45 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,55]]", "result": "20589.03"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,55]]", "result": "1484.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,55]]", "result": "6663.81"}}} 02:36:45 INFO - Return code: 0 02:36:45 INFO - # TBPL SUCCESS # 02:36:45 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 02:36:45 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 02:36:45 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 02:36:45 INFO - 2015-12-04 02:36:45.609 screenresolution[1967:15297] starting screenresolution argv=screenresolution get 02:36:45 INFO - 2015-12-04 02:36:45.613 screenresolution[1967:15297] Display 0: 1600x1200x32@60 02:36:45 INFO - 2015-12-04 02:36:45.619 screenresolution[1968:15300] starting screenresolution argv=screenresolution list 02:36:45 INFO - Available Modes on Display 0 02:36:45 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 02:36:45 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 02:36:45 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 02:36:45 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 02:36:45 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 02:36:45 INFO - Intel HD Graphics 3000: 02:36:45 INFO - Chipset Model: Intel HD Graphics 3000 02:36:45 INFO - Type: GPU 02:36:45 INFO - Bus: Built-In 02:36:45 INFO - VRAM (Total): 512 MB 02:36:45 INFO - VRAM (Dynamic, Max): 10 02:36:45 INFO - Vendor: Intel (0x8086) 02:36:45 INFO - Device ID: 0x0116 02:36:45 INFO - Revision ID: 0x0009 02:36:45 INFO - Displays: 02:36:45 INFO - Display: 02:36:45 INFO - Resolution: 1600 x 1200 @ 60 Hz 02:36:45 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 02:36:45 INFO - Display Serial Number: 1600x1200 60 02:36:45 INFO - Main Display: Yes 02:36:45 INFO - Mirror: Off 02:36:45 INFO - Online: Yes 02:36:45 INFO - Rotation: Supported 02:36:45 INFO - Return code: 0 02:36:45 INFO - Running post-action listener: _resource_record_post_action 02:36:45 INFO - Running post-run listener: _resource_record_post_run 02:36:46 INFO - Total resource usage - Wall time: 1244s; CPU: 30.0%; Read bytes: 3051520; Write bytes: 681683968; Read time: 589; Write time: 53812 02:36:46 INFO - install - Wall time: 36s; CPU: 30.0%; Read bytes: 336509440; Write bytes: 334870528; Read time: 30645; Write time: 5076 02:36:46 INFO - run-tests - Wall time: 1208s; CPU: 30.0%; Read bytes: 3047424; Write bytes: 335705088; Read time: 553; Write time: 48009 02:36:46 INFO - Running post-run listener: _upload_blobber_files 02:36:46 INFO - Blob upload gear active. 02:36:46 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 02:36:46 INFO - Copying logs to upload dir... 02:36:46 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1293.176964 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 33 secs) (at 2015-12-04 02:36:47.035270) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-04 02:36:47.038527) ========= 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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners TMPDIR=/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010208 build_url: 'https://queue.taskcluster.net/v1/task/J6dn8_zTSxqE_Q4Fb4p7lQ/artifacts/public/build/firefox-44.0a2.en-US.mac.dmg' ========= master_lag: 0.01 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-04 02:36:47.059861) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:36:47.060229) ========= 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.WPF3jT3n6P/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.7cRCyvGtt8/Listeners TMPDIR=/var/folders/w5/8gg9p2xn6p5cvvng_jjzx6x800000w/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.005136 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-04 02:36:47.110201) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-04 02:36:47.110524) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-04 02:36:47.110940) ========= ========= Total master_lag: 0.20 =========