builder: mozilla-inbound_yosemite_test-dromaeojs slave: t-yosemite-r5-0041 starttime: 1446530074.54 results: success (0) buildid: 20151102204908 builduid: 71a363363beb408d8bea0141b9ef56ae revision: 7b99659430b166a6bb42129cd3cb5d48cd0e3f56 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.544142) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.544564) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.544877) ========= 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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners TMPDIR=/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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.006084 basedir: '/builds/slave/test' ========= master_lag: 0.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.596449) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.596754) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.617314) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.617633) ========= 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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners TMPDIR=/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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.005320 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.669060) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.669381) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.669755) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:34.670059) ========= 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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners TMPDIR=/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False --2015-11-02 21:54:34-- 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.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% 7.42M=0.002s 2015-11-02 21:54:35 (7.42 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.338132 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:35.032019) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:35.032390) ========= 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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners TMPDIR=/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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.019529 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:35.093393) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2015-11-02 21:54:35.093776) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 7b99659430b166a6bb42129cd3cb5d48cd0e3f56 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 7b99659430b166a6bb42129cd3cb5d48cd0e3f56 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners TMPDIR=/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False 2015-11-02 21:54:35,164 truncating revision to first 12 chars 2015-11-02 21:54:35,165 Setting DEBUG logging. 2015-11-02 21:54:35,165 attempt 1/10 2015-11-02 21:54:35,165 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/7b99659430b1?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-02 21:54:36,451 unpacking tar archive at: mozilla-inbound-7b99659430b1/testing/mozharness/ program finished with exit code 0 elapsedTime=2.052463 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2015-11-02 21:54:37.162467) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:37.162843) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:37.175627) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:37.175925) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-02 21:54:37.176384) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 46 secs) (at 2015-11-02 21:54:37.176708) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 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-Inbound', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners TMPDIR=/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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 21:54:37 INFO - MultiFileLogger online at 20151102 21:54:37 in /builds/slave/test 21:54:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 21:54:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 21:54:37 INFO - {'append_to_log': False, 21:54:37 INFO - 'base_work_dir': '/builds/slave/test', 21:54:37 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 21:54:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 21:54:37 INFO - 'branch': 'Mozilla-Inbound', 21:54:37 INFO - 'buildbot_json_path': 'buildprops.json', 21:54:37 INFO - 'config_files': ('talos/mac_config.py',), 21:54:37 INFO - 'default_actions': ('clobber', 21:54:37 INFO - 'read-buildbot-config', 21:54:37 INFO - 'download-and-extract', 21:54:37 INFO - 'populate-webroot', 21:54:37 INFO - 'create-virtualenv', 21:54:37 INFO - 'install', 21:54:37 INFO - 'run-tests'), 21:54:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 21:54:37 INFO - 'download_minidump_stackwalk': True, 21:54:37 INFO - 'download_symbols': 'ondemand', 21:54:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 21:54:37 INFO - 'tooltool.py': '/tools/tooltool.py', 21:54:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 21:54:37 INFO - '/tools/misc-python/virtualenv.py')}, 21:54:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 21:54:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 21:54:37 INFO - 'installer_path': 'installer.exe', 21:54:37 INFO - 'log_level': 'info', 21:54:37 INFO - 'log_name': 'talos', 21:54:37 INFO - 'log_to_console': True, 21:54:37 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 21:54:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 21:54:37 INFO - 'opt_config_files': (), 21:54:37 INFO - 'pip_index': False, 21:54:37 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 21:54:37 INFO - 'cmd': ('bash', 21:54:37 INFO - '-c', 21:54:37 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 21:54:37 INFO - 'enabled': True, 21:54:37 INFO - 'halt_on_failure': False, 21:54:37 INFO - 'name': 'check_screen_resolution'},), 21:54:37 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 21:54:37 INFO - 'cmd': ('bash', 21:54:37 INFO - '-c', 21:54:37 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 21:54:37 INFO - 'enabled': True, 21:54:37 INFO - 'halt_on_failure': False, 21:54:37 INFO - 'name': 'check_screen_resolution'},), 21:54:37 INFO - 'run_cmd_checks_enabled': True, 21:54:37 INFO - 'sps_profile': False, 21:54:37 INFO - 'sps_profile_interval': 0, 21:54:37 INFO - 'suite': 'dromaeojs', 21:54:37 INFO - 'system_bits': '64', 21:54:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 21:54:37 INFO - 'title': 't-yosemite-r5-0041', 21:54:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 21:54:37 INFO - 'use_talos_json': True, 21:54:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 21:54:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 21:54:37 INFO - 'work_dir': 'build'} 21:54:37 INFO - ##### 21:54:37 INFO - ##### Running clobber step. 21:54:37 INFO - ##### 21:54:37 INFO - Running pre-action listener: _resource_record_pre_action 21:54:37 INFO - Running main action method: clobber 21:54:37 INFO - rmtree: /builds/slave/test/build 21:54:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 21:54:39 INFO - Running post-action listener: _resource_record_post_action 21:54:39 INFO - ##### 21:54:39 INFO - ##### Running read-buildbot-config step. 21:54:39 INFO - ##### 21:54:39 INFO - Running pre-action listener: _resource_record_pre_action 21:54:39 INFO - Running main action method: read_buildbot_config 21:54:39 INFO - Using buildbot properties: 21:54:39 INFO - { 21:54:39 INFO - "properties": { 21:54:39 INFO - "buildnumber": 3248, 21:54:39 INFO - "product": "firefox", 21:54:39 INFO - "script_repo_revision": "production", 21:54:39 INFO - "builddir": "mozilla-inbound_yosemite_test-dromaeojs", 21:54:39 INFO - "repository": "", 21:54:39 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 mozilla-inbound talos dromaeojs", 21:54:39 INFO - "buildid": "20151102204908", 21:54:39 INFO - "slavename": "t-yosemite-r5-0041", 21:54:39 INFO - "pgo_build": "False", 21:54:39 INFO - "basedir": "/builds/slave/test", 21:54:39 INFO - "project": "", 21:54:39 INFO - "platform": "yosemite", 21:54:39 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 21:54:39 INFO - "slavebuilddir": "test", 21:54:39 INFO - "scheduler": "tests-mozilla-inbound-macosx64-talos", 21:54:39 INFO - "branch": "mozilla-inbound", 21:54:39 INFO - "repo_path": "integration/mozilla-inbound", 21:54:39 INFO - "stage_platform": "macosx64", 21:54:39 INFO - "builduid": "71a363363beb408d8bea0141b9ef56ae", 21:54:39 INFO - "revision": "7b99659430b166a6bb42129cd3cb5d48cd0e3f56" 21:54:39 INFO - }, 21:54:39 INFO - "sourcestamp": { 21:54:39 INFO - "repository": "", 21:54:39 INFO - "hasPatch": false, 21:54:39 INFO - "project": "", 21:54:39 INFO - "branch": "mozilla-inbound-macosx64-talos", 21:54:39 INFO - "changes": [ 21:54:39 INFO - { 21:54:39 INFO - "category": null, 21:54:39 INFO - "files": [ 21:54:39 INFO - { 21:54:39 INFO - "url": null, 21:54:39 INFO - "name": "https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 21:54:39 INFO - } 21:54:39 INFO - ], 21:54:39 INFO - "repository": "", 21:54:39 INFO - "rev": "7b99659430b166a6bb42129cd3cb5d48cd0e3f56", 21:54:39 INFO - "who": "mwoodrow@mozilla.com", 21:54:39 INFO - "when": 1446530001, 21:54:39 INFO - "number": 6613087, 21:54:39 INFO - "comments": "Bug 1203199 - Fix trailing comma causing bustage. CLOSED TREE", 21:54:39 INFO - "project": "", 21:54:39 INFO - "at": "Mon 02 Nov 2015 21:53:21", 21:54:39 INFO - "branch": "mozilla-inbound-macosx64-talos", 21:54:39 INFO - "revlink": "", 21:54:39 INFO - "properties": [ 21:54:39 INFO - [ 21:54:39 INFO - "buildid", 21:54:39 INFO - "20151102204908", 21:54:39 INFO - "Change" 21:54:39 INFO - ], 21:54:39 INFO - [ 21:54:39 INFO - "builduid", 21:54:39 INFO - "71a363363beb408d8bea0141b9ef56ae", 21:54:39 INFO - "Change" 21:54:39 INFO - ], 21:54:39 INFO - [ 21:54:39 INFO - "pgo_build", 21:54:39 INFO - "False", 21:54:39 INFO - "Change" 21:54:39 INFO - ] 21:54:39 INFO - ], 21:54:39 INFO - "revision": "7b99659430b166a6bb42129cd3cb5d48cd0e3f56" 21:54:39 INFO - } 21:54:39 INFO - ], 21:54:39 INFO - "revision": "7b99659430b166a6bb42129cd3cb5d48cd0e3f56" 21:54:39 INFO - } 21:54:39 INFO - } 21:54:39 INFO - Found installer url https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 21:54:39 INFO - Running post-action listener: _resource_record_post_action 21:54:39 INFO - ##### 21:54:39 INFO - ##### Running download-and-extract step. 21:54:39 INFO - ##### 21:54:39 INFO - Running pre-action listener: _resource_record_pre_action 21:54:39 INFO - Running main action method: download_and_extract 21:54:39 INFO - mkdir: /builds/slave/test/build/tests 21:54: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')]} 21:54:39 INFO - https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 21:54:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/test_packages.json 21:54:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/test_packages.json 21:54:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 21:54:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 21:54:42 INFO - Downloaded 1149 bytes. 21:54:42 INFO - Reading from file /builds/slave/test/build/test_packages.json 21:54:42 INFO - Using the following test package requirements: 21:54:42 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 21:54:42 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 21:54:42 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 21:54:42 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 21:54:42 INFO - u'jsshell-mac.zip'], 21:54:42 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 21:54:42 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 21:54:42 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 21:54:42 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 21:54:42 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 21:54:42 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 21:54:42 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 21:54:42 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 21:54:42 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 21:54:42 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 21:54:42 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 21:54:42 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 21:54:42 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 21:54:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:54:42 INFO - https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 21:54:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 21:54:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 21:54:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 21:54:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 21:54:43 INFO - Downloaded 17452402 bytes. 21:54:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 21:54:43 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 21:54:43 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 21:54:49 INFO - Return code: 0 21:54:49 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 21:54:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:54:49 INFO - https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 21:54:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 21:54:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 21:54:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 21:54:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 21:54:51 INFO - Downloaded 17452402 bytes. 21:54:51 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 21:54:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 21:54:51 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 21:54:57 INFO - Return code: 0 21:54:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:54:57 INFO - https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 21:54:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 21:54:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 21:54:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 21:54:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 21:54:58 INFO - Downloaded 11131307 bytes. 21:54:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 21:54:58 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 21:54:58 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 21:54:58 INFO - Return code: 0 21:54:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:54:58 INFO - https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 21:54:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 21:54:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 21:54:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 21:54:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 21:55:04 INFO - Downloaded 108624623 bytes. 21:55:04 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 21:55:04 INFO - mkdir: /builds/slave/test/properties 21:55:04 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 21:55:04 INFO - Writing to file /builds/slave/test/properties/build_url 21:55:04 INFO - Contents: 21:55:04 INFO - build_url:https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 21:55:04 INFO - Running post-action listener: _resource_record_post_action 21:55:04 INFO - Running post-action listener: set_extra_try_arguments 21:55:04 INFO - ##### 21:55:04 INFO - ##### Running populate-webroot step. 21:55:04 INFO - ##### 21:55:04 INFO - Running pre-action listener: _resource_record_pre_action 21:55:04 INFO - Running main action method: populate_webroot 21:55:04 INFO - Guessing talos json url... 21:55:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:04 INFO - https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt matches https://queue.taskcluster.net 21:55:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 21:55:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 21:55:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt to /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 21:55:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.txt'}, attempt #1 21:55:04 INFO - Downloaded 111 bytes. 21:55:04 INFO - Reading from file /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 21:55:04 INFO - Contents: 21:55:04 INFO - 20151102204908 21:55:04 INFO - https://hg.mozilla.org/integration/mozilla-inbound/rev/7b99659430b166a6bb42129cd3cb5d48cd0e3f56 21:55:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:04 INFO - trying https://hg.mozilla.org/integration/mozilla-inbound/raw-file/7b99659430/testing/talos/talos.json 21:55:04 INFO - Downloading https://hg.mozilla.org/integration/mozilla-inbound/raw-file/7b99659430/testing/talos/talos.json to /builds/slave/test/build/talos.json 21:55:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/integration/mozilla-inbound/raw-file/7b99659430/testing/talos/talos.json', 'file_name': '/builds/slave/test/build/talos.json'}, attempt #1 21:55:05 INFO - Downloaded 4264 bytes. 21:55:05 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 21:55:05 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 21:55:05 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 21:55:05 INFO - '../fennec_ids.txt'], 21:55:05 INFO - 'tests': ['tcheck2']}, 21:55:05 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 21:55:05 INFO - '--tppagecycles', 21:55:05 INFO - '7'], 21:55:05 INFO - 'tests': ['tsvgm']}}, 21:55:05 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 21:55:05 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['tresize', 'tcanvasmark']}, 21:55:05 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 21:55:05 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 21:55:05 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:55:05 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 21:55:05 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:55:05 INFO - 'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 21:55:05 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:55:05 INFO - 'tests': ['damp', 'tps']}, 21:55:05 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:55:05 INFO - 'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['damp', 'tps']}, 21:55:05 INFO - 'g3': {'tests': ['dromaeo_dom']}, 21:55:05 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 21:55:05 INFO - 'other': {'tests': ['a11yr', 21:55:05 INFO - 'ts_paint', 21:55:05 INFO - 'tpaint', 21:55:05 INFO - 'sessionrestore', 21:55:05 INFO - 'sessionrestore_no_auto_restore']}, 21:55:05 INFO - 'other-e10s': {'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['a11yr', 21:55:05 INFO - 'ts_paint', 21:55:05 INFO - 'tpaint', 21:55:05 INFO - 'sessionrestore', 21:55:05 INFO - 'sessionrestore_no_auto_restore']}, 21:55:05 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['a11yr', 21:55:05 INFO - 'ts_paint', 21:55:05 INFO - 'tpaint', 21:55:05 INFO - 'sessionrestore', 21:55:05 INFO - 'sessionrestore_no_auto_restore']}, 21:55:05 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['a11yr', 21:55:05 INFO - 'ts_paint', 21:55:05 INFO - 'tpaint', 21:55:05 INFO - 'sessionrestore', 21:55:05 INFO - 'sessionrestore_no_auto_restore']}, 21:55:05 INFO - 'other_l64': {'tests': ['a11yr', 21:55:05 INFO - 'ts_paint', 21:55:05 INFO - 'tpaint', 21:55:05 INFO - 'sessionrestore', 21:55:05 INFO - 'sessionrestore_no_auto_restore']}, 21:55:05 INFO - 'other_nol64': {'tests': ['a11yr', 21:55:05 INFO - 'ts_paint', 21:55:05 INFO - 'tpaint', 21:55:05 INFO - 'sessionrestore', 21:55:05 INFO - 'sessionrestore_no_auto_restore']}, 21:55:05 INFO - 'svgr': {'tests': ['tsvgx', 21:55:05 INFO - 'tsvgr_opacity', 21:55:05 INFO - 'tart', 21:55:05 INFO - 'tscrollx', 21:55:05 INFO - 'cart']}, 21:55:05 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['tsvgx', 21:55:05 INFO - 'tsvgr_opacity', 21:55:05 INFO - 'tart', 21:55:05 INFO - 'tscrollx', 21:55:05 INFO - 'cart']}, 21:55:05 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:55:05 INFO - 'tests': ['tp5o']}, 21:55:05 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:55:05 INFO - 'talos_options': ['--e10s'], 21:55:05 INFO - 'tests': ['tp5o']}, 21:55:05 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:55:05 INFO - 'talos_options': ['--xperf_path', 21:55:05 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 21:55:05 INFO - 'tests': ['tp5n']}, 21:55:05 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:55:05 INFO - 'talos_options': ['--e10s', 21:55:05 INFO - '--xperf_path', 21:55:05 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 21:55:05 INFO - 'C:/slave/talos-data/talos/xperf.config'], 21:55:05 INFO - 'tests': ['tp5n']}}, 21:55:05 INFO - 'talos.zip': {'path': '', 21:55:05 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 21:55:05 INFO - Running post-action listener: _resource_record_post_action 21:55:05 INFO - ##### 21:55:05 INFO - ##### Running create-virtualenv step. 21:55:05 INFO - ##### 21:55:05 INFO - Running pre-action listener: _resource_record_pre_action 21:55:05 INFO - Running main action method: create_virtualenv 21:55:05 INFO - Creating virtualenv /builds/slave/test/build/venv 21:55:05 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 21:55:05 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 21:55:05 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 21:55:05 INFO - Using real prefix '/tools/python27' 21:55:05 INFO - New python executable in /builds/slave/test/build/venv/bin/python 21:55:06 INFO - Installing distribute.............................................................................................................................................................................................done. 21:55:10 INFO - Installing pip.................done. 21:55:10 INFO - Return code: 0 21:55:10 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 21:55:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:55:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:55:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--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 0x109e22a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e8f228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff232d67140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109dd79f0>, '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 0x109b36cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109da1990>, '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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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 21:55:10 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 21:55:10 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 21:55:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.RbO52Cy5dJ/Render', 21:55:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 21:55:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 21:55:10 INFO - 'HOME': '/Users/cltbld', 21:55:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 21:55:10 INFO - 'LOGNAME': 'cltbld', 21:55:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:55:10 INFO - 'MOZ_NO_REMOTE': '1', 21:55:10 INFO - 'NO_EM_RESTART': '1', 21:55:10 INFO - 'PAGER': '/bin/cat', 21:55:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 21:55:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:55:10 INFO - 'PWD': '/builds/slave/test', 21:55:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 21:55:10 INFO - 'SHELL': '/bin/bash', 21:55:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zY5Qx5Nfao/Listeners', 21:55:10 INFO - 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/', 21:55:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 21:55:10 INFO - 'USER': 'cltbld', 21:55:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 21:55:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 21:55:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:55:10 INFO - 'XPC_FLAGS': '0x0', 21:55:10 INFO - 'XPC_SERVICE_NAME': '0', 21:55:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 21:55:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:55:10 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 21:55:10 INFO - Cleaning up... 21:55:10 INFO - Return code: 0 21:55:10 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 21:55:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:55:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:55:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--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 0x109e22a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e8f228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff232d67140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109dd79f0>, '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 0x109b36cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109da1990>, '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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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 21:55:10 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 21:55:10 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 21:55:10 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.RbO52Cy5dJ/Render', 21:55:10 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 21:55:10 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 21:55:10 INFO - 'HOME': '/Users/cltbld', 21:55:10 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 21:55:10 INFO - 'LOGNAME': 'cltbld', 21:55:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:55:10 INFO - 'MOZ_NO_REMOTE': '1', 21:55:10 INFO - 'NO_EM_RESTART': '1', 21:55:10 INFO - 'PAGER': '/bin/cat', 21:55:10 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 21:55:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:55:10 INFO - 'PWD': '/builds/slave/test', 21:55:10 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 21:55:10 INFO - 'SHELL': '/bin/bash', 21:55:10 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zY5Qx5Nfao/Listeners', 21:55:10 INFO - 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/', 21:55:10 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 21:55:10 INFO - 'USER': 'cltbld', 21:55:10 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 21:55:10 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 21:55:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:55:10 INFO - 'XPC_FLAGS': '0x0', 21:55:10 INFO - 'XPC_SERVICE_NAME': '0', 21:55:10 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 21:55:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:55:10 INFO - Downloading/unpacking psutil>=0.7.1 21:55:10 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 21:55:10 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 21:55:10 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 21:55:10 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 21:55:10 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 21:55:10 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 21:55:12 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 21:55:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 21:55:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 21:55:13 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 21:55:13 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 21:55:13 INFO - Installing collected packages: psutil 21:55:13 INFO - Running setup.py install for psutil 21:55:13 INFO - building 'psutil._psutil_osx' extension 21:55:13 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 21:55:13 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 21:55:13 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 21:55:13 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 21:55:13 INFO - building 'psutil._psutil_posix' extension 21:55:13 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 21:55:13 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 21:55:13 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 21:55:13 INFO - ^ 21:55:13 INFO - 1 warning generated. 21:55:13 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 21:55:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 21:55:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 21:55:14 INFO - Successfully installed psutil 21:55:14 INFO - Cleaning up... 21:55:14 INFO - Return code: 0 21:55:14 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 21:55:14 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')]} 21:55:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:55:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:14 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')]} 21:55:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:55:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:14 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 0x109e22a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e8f228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff232d67140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109dd79f0>, '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 0x109b36cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109da1990>, '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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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 21:55:14 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 21:55:14 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 21:55:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.RbO52Cy5dJ/Render', 21:55:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 21:55:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 21:55:14 INFO - 'HOME': '/Users/cltbld', 21:55:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 21:55:14 INFO - 'LOGNAME': 'cltbld', 21:55:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:55:14 INFO - 'MOZ_NO_REMOTE': '1', 21:55:14 INFO - 'NO_EM_RESTART': '1', 21:55:14 INFO - 'PAGER': '/bin/cat', 21:55:14 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 21:55:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:55:14 INFO - 'PWD': '/builds/slave/test', 21:55:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 21:55:14 INFO - 'SHELL': '/bin/bash', 21:55:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zY5Qx5Nfao/Listeners', 21:55:14 INFO - 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/', 21:55:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 21:55:14 INFO - 'USER': 'cltbld', 21:55:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 21:55:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 21:55:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:55:14 INFO - 'XPC_FLAGS': '0x0', 21:55:14 INFO - 'XPC_SERVICE_NAME': '0', 21:55:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 21:55:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:55:14 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 21:55:14 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 21:55:14 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 21:55:14 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 21:55:14 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 21:55:14 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 21:55:14 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 21:55:16 INFO - Downloading mozsystemmonitor-0.0.tar.gz 21:55:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 21:55:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 21:55:16 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 21:55:16 INFO - Installing collected packages: mozsystemmonitor 21:55:16 INFO - Running setup.py install for mozsystemmonitor 21:55:17 INFO - Successfully installed mozsystemmonitor 21:55:17 INFO - Cleaning up... 21:55:17 INFO - Return code: 0 21:55:17 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 21:55:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:55:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:55:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--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 0x109e22a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e8f228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff232d67140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109dd79f0>, '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 0x109b36cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109da1990>, '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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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 21:55:17 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 21:55:17 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 21:55:17 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.RbO52Cy5dJ/Render', 21:55:17 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 21:55:17 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 21:55:17 INFO - 'HOME': '/Users/cltbld', 21:55:17 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 21:55:17 INFO - 'LOGNAME': 'cltbld', 21:55:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:55:17 INFO - 'MOZ_NO_REMOTE': '1', 21:55:17 INFO - 'NO_EM_RESTART': '1', 21:55:17 INFO - 'PAGER': '/bin/cat', 21:55:17 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 21:55:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:55:17 INFO - 'PWD': '/builds/slave/test', 21:55:17 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 21:55:17 INFO - 'SHELL': '/bin/bash', 21:55:17 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zY5Qx5Nfao/Listeners', 21:55:17 INFO - 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/', 21:55:17 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 21:55:17 INFO - 'USER': 'cltbld', 21:55:17 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 21:55:17 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 21:55:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:55:17 INFO - 'XPC_FLAGS': '0x0', 21:55:17 INFO - 'XPC_SERVICE_NAME': '0', 21:55:17 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 21:55:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:55:17 INFO - Downloading/unpacking blobuploader==1.2.4 21:55:17 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 21:55:17 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 21:55:17 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 21:55:17 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 21:55:17 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 21:55:17 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 21:55:19 INFO - Downloading blobuploader-1.2.4.tar.gz 21:55:19 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 21:55:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 21:55:20 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 21:55:20 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 21:55:20 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 21:55:20 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 21:55:20 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 21:55:20 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 21:55:20 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 21:55:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 21:55:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 21:55:20 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 21:55:20 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 21:55:20 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 21:55:20 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 21:55:20 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 21:55:20 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 21:55:20 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 21:55:21 INFO - Downloading docopt-0.6.1.tar.gz 21:55:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 21:55:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 21:55:21 INFO - Installing collected packages: blobuploader, requests, docopt 21:55:21 INFO - Running setup.py install for blobuploader 21:55:21 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 21:55:21 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 21:55:21 INFO - Running setup.py install for requests 21:55:22 INFO - Running setup.py install for docopt 21:55:22 INFO - Successfully installed blobuploader requests docopt 21:55:22 INFO - Cleaning up... 21:55:22 INFO - Return code: 0 21:55:22 INFO - Installing None into virtualenv /builds/slave/test/build/venv 21:55: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')]} 21:55:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:55:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55: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')]} 21:55:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:55:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:22 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 0x109e22a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e8f228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff232d67140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109dd79f0>, '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 0x109b36cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109da1990>, '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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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 21:55:22 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 21:55:22 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 21:55:22 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.RbO52Cy5dJ/Render', 21:55:22 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 21:55:22 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 21:55:22 INFO - 'HOME': '/Users/cltbld', 21:55:22 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 21:55:22 INFO - 'LOGNAME': 'cltbld', 21:55:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:55:22 INFO - 'MOZ_NO_REMOTE': '1', 21:55:22 INFO - 'NO_EM_RESTART': '1', 21:55:22 INFO - 'PAGER': '/bin/cat', 21:55:22 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 21:55:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:55:22 INFO - 'PWD': '/builds/slave/test', 21:55:22 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 21:55:22 INFO - 'SHELL': '/bin/bash', 21:55:22 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zY5Qx5Nfao/Listeners', 21:55:22 INFO - 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/', 21:55:22 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 21:55:22 INFO - 'USER': 'cltbld', 21:55:22 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 21:55:22 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 21:55:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:55:22 INFO - 'XPC_FLAGS': '0x0', 21:55:22 INFO - 'XPC_SERVICE_NAME': '0', 21:55:22 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 21:55:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:55:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 21:55:22 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-zIRqTs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 21:55:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 21:55:22 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-T5BW5R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 21:55:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 21:55:22 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-SxqGYB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 21:55:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 21:55:22 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-cl_7Dc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 21:55:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 21:55:23 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-VLJKd8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 21:55:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 21:55:23 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-DW_cje-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 21:55:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 21:55:23 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-tsKMov-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 21:55:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 21:55:23 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-f38Qwo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 21:55:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 21:55:23 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-7MvAU5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 21:55:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 21:55:23 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-2Tdnh3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 21:55:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 21:55:23 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-4F4CKA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 21:55:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 21:55:23 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-3Nemd0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 21:55:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 21:55:24 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-YBlEWp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 21:55:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 21:55:24 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-PMIj55-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 21:55:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 21:55:24 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-WIOjnn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 21:55:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 21:55:24 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-5E_0Y_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 21:55:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 21:55:24 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-uz5sJD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 21:55:24 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 21:55:24 INFO - Running setup.py install for manifestparser 21:55:24 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 21:55:24 INFO - Running setup.py install for mozcrash 21:55:24 INFO - Running setup.py install for mozdebug 21:55:25 INFO - Running setup.py install for mozdevice 21:55:25 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 21:55:25 INFO - Installing dm script to /builds/slave/test/build/venv/bin 21:55:25 INFO - Running setup.py install for mozfile 21:55:25 INFO - Running setup.py install for mozhttpd 21:55:25 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 21:55:25 INFO - Running setup.py install for mozinfo 21:55:25 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 21:55:25 INFO - Running setup.py install for mozInstall 21:55:25 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 21:55:25 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 21:55:25 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 21:55:25 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 21:55:25 INFO - Running setup.py install for mozleak 21:55:26 INFO - Running setup.py install for mozlog 21:55:26 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 21:55:26 INFO - Running setup.py install for moznetwork 21:55:26 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 21:55:26 INFO - Running setup.py install for mozprocess 21:55:26 INFO - Running setup.py install for mozprofile 21:55:26 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 21:55:26 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 21:55:26 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 21:55:26 INFO - Running setup.py install for mozrunner 21:55:27 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 21:55:27 INFO - Running setup.py install for mozscreenshot 21:55:27 INFO - Running setup.py install for moztest 21:55:27 INFO - Running setup.py install for mozversion 21:55:27 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 21:55:27 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 21:55:27 INFO - Cleaning up... 21:55:27 INFO - Return code: 0 21:55:27 INFO - Installing None into virtualenv /builds/slave/test/build/venv 21:55:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:55:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:55:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:27 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 0x109e22a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e8f228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff232d67140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109dd79f0>, '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 0x109b36cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109da1990>, '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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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 21:55:27 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 21:55:27 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 21:55:27 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.RbO52Cy5dJ/Render', 21:55:27 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 21:55:27 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 21:55:27 INFO - 'HOME': '/Users/cltbld', 21:55:27 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 21:55:27 INFO - 'LOGNAME': 'cltbld', 21:55:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:55:27 INFO - 'MOZ_NO_REMOTE': '1', 21:55:27 INFO - 'NO_EM_RESTART': '1', 21:55:27 INFO - 'PAGER': '/bin/cat', 21:55:27 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 21:55:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:55:27 INFO - 'PWD': '/builds/slave/test', 21:55:27 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 21:55:27 INFO - 'SHELL': '/bin/bash', 21:55:27 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zY5Qx5Nfao/Listeners', 21:55:27 INFO - 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/', 21:55:27 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 21:55:27 INFO - 'USER': 'cltbld', 21:55:27 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 21:55:27 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 21:55:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:55:27 INFO - 'XPC_FLAGS': '0x0', 21:55:27 INFO - 'XPC_SERVICE_NAME': '0', 21:55:27 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 21:55:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:55:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 21:55:27 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-RZdDwu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 21:55:28 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)) 21:55:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 21:55:28 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-Ov_DDl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 21:55:28 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)) 21:55:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 21:55:28 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-N7p1VD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 21:55:28 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)) 21:55:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 21:55:28 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-M1SGxk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 21:55:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 21:55:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 21:55:28 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-JQkgEk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 21:55:28 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)) 21:55:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 21:55:28 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-oaLkXk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 21:55:28 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)) 21:55:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 21:55:28 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-kNzoeN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 21:55:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 21:55:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 21:55:28 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-daf7OH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 21:55:28 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)) 21:55:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 21:55:28 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-PFZF37-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 21:55:29 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)) 21:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 21:55:29 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-sQqBV2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 21:55:29 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)) 21:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 21:55:29 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-GaVu8x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 21:55:29 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)) 21:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 21:55:29 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-Qfgp2o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 21:55:29 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)) 21:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 21:55:29 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-kec_7u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 21:55:29 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)) 21:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 21:55:29 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-rDAspX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 21:55:29 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)) 21:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 21:55:29 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-ny3nRB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 21:55:29 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)) 21:55:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 21:55:29 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-LTrJVl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 21:55:30 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)) 21:55:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 21:55:30 INFO - Running setup.py (path:/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/pip-HtiZlz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 21:55:30 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)) 21:55:30 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)) 21:55:30 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)) 21:55:30 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)) 21:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 21:55:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 21:55:30 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 21:55:30 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 21:55:30 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 21:55:30 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 21:55:30 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 21:55:30 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 21:55:30 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 21:55:32 INFO - Downloading blessings-1.5.1.tar.gz 21:55:32 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 21:55:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 21:55:32 INFO - Installing collected packages: blessings 21:55:32 INFO - Running setup.py install for blessings 21:55:32 INFO - Successfully installed blessings 21:55:32 INFO - Cleaning up... 21:55:32 INFO - Return code: 0 21:55:32 INFO - Done creating virtualenv /builds/slave/test/build/venv. 21:55:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 21:55:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 21:55:33 INFO - Reading from file tmpfile_stdout 21:55:33 INFO - Current package versions: 21:55:33 INFO - blessings == 1.5.1 21:55:33 INFO - blobuploader == 1.2.4 21:55:33 INFO - docopt == 0.6.1 21:55:33 INFO - manifestparser == 1.1 21:55:33 INFO - mozInstall == 1.12 21:55:33 INFO - mozcrash == 0.16 21:55:33 INFO - mozdebug == 0.1 21:55:33 INFO - mozdevice == 0.47 21:55:33 INFO - mozfile == 1.2 21:55:33 INFO - mozhttpd == 0.7 21:55:33 INFO - mozinfo == 0.9 21:55:33 INFO - mozleak == 0.1 21:55:33 INFO - mozlog == 3.0 21:55:33 INFO - moznetwork == 0.27 21:55:33 INFO - mozprocess == 0.22 21:55:33 INFO - mozprofile == 0.27 21:55:33 INFO - mozrunner == 6.11 21:55:33 INFO - mozscreenshot == 0.1 21:55:33 INFO - mozsystemmonitor == 0.0 21:55:33 INFO - moztest == 0.7 21:55:33 INFO - mozversion == 1.4 21:55:33 INFO - psutil == 3.1.1 21:55:33 INFO - requests == 1.2.3 21:55:33 INFO - wsgiref == 0.1.2 21:55:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 21:55:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:55:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:55:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:55:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:55:33 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 0x109e22a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e8f228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff232d67140>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109dd79f0>, '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 0x109b36cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109da1990>, '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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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 21:55:33 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 21:55:33 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 21:55:33 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.RbO52Cy5dJ/Render', 21:55:33 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 21:55:33 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 21:55:33 INFO - 'HOME': '/Users/cltbld', 21:55:33 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 21:55:33 INFO - 'LOGNAME': 'cltbld', 21:55:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:55:33 INFO - 'MOZ_NO_REMOTE': '1', 21:55:33 INFO - 'NO_EM_RESTART': '1', 21:55:33 INFO - 'PAGER': '/bin/cat', 21:55:33 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 21:55:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:55:33 INFO - 'PWD': '/builds/slave/test', 21:55:33 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 21:55:33 INFO - 'SHELL': '/bin/bash', 21:55:33 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zY5Qx5Nfao/Listeners', 21:55:33 INFO - 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/', 21:55:33 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 21:55:33 INFO - 'USER': 'cltbld', 21:55:33 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 21:55:33 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 21:55:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:55:33 INFO - 'XPC_FLAGS': '0x0', 21:55:33 INFO - 'XPC_SERVICE_NAME': '0', 21:55:33 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 21:55:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 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)) 21:55:33 INFO - Cleaning up... 21:55:33 INFO - Return code: 0 21:55:33 INFO - Running post-action listener: _resource_record_post_action 21:55:33 INFO - Running post-action listener: _start_resource_monitoring 21:55:33 INFO - Starting resource monitoring. 21:55:33 INFO - ##### 21:55:33 INFO - ##### Running install step. 21:55:33 INFO - ##### 21:55:33 INFO - Running pre-action listener: _resource_record_pre_action 21:55:33 INFO - Running main action method: install 21:55:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 21:55:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 21:55:33 INFO - Reading from file tmpfile_stdout 21:55:33 INFO - Detecting whether we're running mozinstall >=1.0... 21:55:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 21:55:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 21:55:34 INFO - Reading from file tmpfile_stdout 21:55:34 INFO - Output received: 21:55:34 INFO - Usage: mozinstall [options] installer 21:55:34 INFO - Options: 21:55:34 INFO - -h, --help show this help message and exit 21:55:34 INFO - -d DEST, --destination=DEST 21:55:34 INFO - Directory to install application into. [default: 21:55:34 INFO - "/builds/slave/test"] 21:55:34 INFO - --app=APP Application being installed. [default: firefox] 21:55:34 INFO - mkdir: /builds/slave/test/build/application 21:55:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 21:55:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 21:56:11 INFO - Reading from file tmpfile_stdout 21:56:11 INFO - Output received: 21:56:11 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 21:56:11 INFO - Running post-action listener: _resource_record_post_action 21:56:11 INFO - ##### 21:56:11 INFO - ##### Running run-tests step. 21:56:11 INFO - ##### 21:56:11 INFO - Running pre-action listener: _resource_record_pre_action 21:56:11 INFO - Running main action method: run_tests 21:56:11 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 21:56:11 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 21:56:11 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 21:56:11 INFO - 2015-11-02 21:56:11.828 screenresolution[1937:13112] starting screenresolution argv=screenresolution get 21:56:11 INFO - 2015-11-02 21:56:11.831 screenresolution[1937:13112] Display 0: 1600x1200x32@60 21:56:11 INFO - 2015-11-02 21:56:11.837 screenresolution[1938:13114] starting screenresolution argv=screenresolution list 21:56:11 INFO - Available Modes on Display 0 21:56:11 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 21:56:11 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 21:56:11 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 21:56:11 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 21:56:12 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 21:56:12 INFO - Intel HD Graphics 3000: 21:56:12 INFO - Chipset Model: Intel HD Graphics 3000 21:56:12 INFO - Type: GPU 21:56:12 INFO - Bus: Built-In 21:56:12 INFO - VRAM (Total): 512 MB 21:56:12 INFO - VRAM (Dynamic, Max): 10 21:56:12 INFO - Vendor: Intel (0x8086) 21:56:12 INFO - Device ID: 0x0116 21:56:12 INFO - Revision ID: 0x0009 21:56:12 INFO - Displays: 21:56:12 INFO - Display: 21:56:12 INFO - Resolution: 1600 x 1200 @ 60 Hz 21:56:12 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 21:56:12 INFO - Display Serial Number: 1600x1200 60 21:56:12 INFO - Main Display: Yes 21:56:12 INFO - Mirror: Off 21:56:12 INFO - Online: Yes 21:56:12 INFO - Rotation: Supported 21:56:12 INFO - Return code: 0 21:56:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 21:56:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 21:56:12 INFO - Python 2.7.3 21:56:12 INFO - Return code: 0 21:56:12 INFO - grabbing minidump binary from tooltool 21:56:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:56:12 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 0x109dd79f0>, '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 0x109b36cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109da1990>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 21:56:12 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 21:56:12 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 21:56:12 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 21:56:12 INFO - Return code: 0 21:56:12 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 21:56:12 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 21:56:12 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 21:56:12 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 21:56:12 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 21:56:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0041', '--webServer', 'localhost'] in /builds/slave/test/build 21:56:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0041 --webServer localhost 21:56:12 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.RbO52Cy5dJ/Render', 21:56:12 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 21:56:12 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 21:56:12 INFO - 'HOME': '/Users/cltbld', 21:56:12 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 21:56:12 INFO - 'LOGNAME': 'cltbld', 21:56:12 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 21:56:12 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 21:56:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:56:12 INFO - 'MOZ_NO_REMOTE': '1', 21:56:12 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 21:56:12 INFO - 'NO_EM_RESTART': '1', 21:56:12 INFO - 'PAGER': '/bin/cat', 21:56:12 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 21:56:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:56:12 INFO - 'PWD': '/builds/slave/test', 21:56:12 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 21:56:12 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 21:56:12 INFO - 'SHELL': '/bin/bash', 21:56:12 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.zY5Qx5Nfao/Listeners', 21:56:12 INFO - 'TMPDIR': '/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/', 21:56:12 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 21:56:12 INFO - 'USER': 'cltbld', 21:56:12 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 21:56:12 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 21:56:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:56:12 INFO - 'XPC_FLAGS': '0x0', 21:56:12 INFO - 'XPC_SERVICE_NAME': '0', 21:56:12 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 21:56:12 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0041', '--webServer', 'localhost'] with output_timeout 3600 21:56:12 INFO - mozversion INFO | application_buildid: 20151102204908 21:56:12 INFO - mozversion INFO | application_changeset: 7b99659430b166a6bb42129cd3cb5d48cd0e3f56 21:56:12 INFO - mozversion INFO | application_display_name: Nightly 21:56:12 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 21:56:12 INFO - mozversion INFO | application_name: Firefox 21:56:12 INFO - mozversion INFO | application_remotingname: firefox 21:56:12 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/mozilla-inbound 21:56:12 INFO - mozversion INFO | application_vendor: Mozilla 21:56:12 INFO - mozversion INFO | application_version: 45.0a1 21:56:12 INFO - mozversion INFO | platform_buildid: 20151102204908 21:56:12 INFO - mozversion INFO | platform_changeset: 7b99659430b166a6bb42129cd3cb5d48cd0e3f56 21:56:12 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 21:56:12 INFO - mozversion INFO | platform_version: 45.0a1 21:56:12 INFO - 2015-11-02 21:56:12,438 DEBUG : using testdate: 1446530172 21:56:12 INFO - 2015-11-02 21:56:12,438 DEBUG : actual date: 1446530172 21:56:12 INFO - 2015-11-02 21:56:12,526 INFO : starting webserver on 'localhost:49730' 21:56:12 INFO - 2015-11-02 21:56:12,527 INFO : Starting test suite t-yosemite-r5-0041 21:56:12 INFO - 2015-11-02 21:56:12,527 INFO : Starting test dromaeo_css 21:56:12 INFO - 2015-11-02 21:56:12,527 DEBUG : operating with platform_type : mac_ 21:56:12 INFO - 2015-11-02 21:56:12,528 INFO : Initialising browser for dromaeo_css test... 21:56:12 INFO - 2015-11-02 21:56:12,560 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/tmpSEBnb0/profile http://localhost:49730/getInfo.html 21:56:14 INFO - 2015-11-02 21:56:14,874 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 21:56:14 INFO - 2015-11-02 21:56:14,874 DEBUG : BROWSER_OUTPUT: colorDepth:24 21:56:14 INFO - 2015-11-02 21:56:14,874 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 21:56:14 INFO - 2015-11-02 21:56:14,874 DEBUG : BROWSER_OUTPUT: __metrics 21:56:14 INFO - 2015-11-02 21:56:14,890 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 21:56:15 INFO - 2015-11-02 21:56:15,561 INFO : Browser initialized. 21:56:15 INFO - 2015-11-02 21:56:15,561 INFO : Running cycle 1/1 for dromaeo_css test... 21:56:15 INFO - 2015-11-02 21:56:15,561 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/tmpSEBnb0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 21:56:27 INFO - 2015-11-02 21:56:27,522 DEBUG : BROWSER_OUTPUT: RSS: Main: 220684288 21:56:27 INFO - 2015-11-02 21:56:27,522 DEBUG : BROWSER_OUTPUT: 21:57:18 INFO - 2015-11-02 21:57:18,663 DEBUG : BROWSER_OUTPUT: 1446530238658 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] 21:59:29 INFO - 2015-11-02 21:59:29,846 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49730/tests/dromaeo/cssquery-ext.html) 21:59:30 INFO - 2015-11-02 21:59:30,928 DEBUG : BROWSER_OUTPUT: RSS: Main: 324030464 21:59:30 INFO - 2015-11-02 21:59:30,928 DEBUG : BROWSER_OUTPUT: 22:02:33 INFO - 2015-11-02 22:02:33,594 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/dromaeo/cssquery-ext.html (next: http://localhost:49730/tests/dromaeo/cssquery-jquery.html) 22:02:34 INFO - 2015-11-02 22:02:34,174 DEBUG : BROWSER_OUTPUT: RSS: Main: 354349056 22:02:34 INFO - 2015-11-02 22:02:34,174 DEBUG : BROWSER_OUTPUT: 22:05:36 INFO - 2015-11-02 22:05:36,268 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49730/tests/dromaeo/cssquery-mootools.html) 22:05:36 INFO - 2015-11-02 22:05:36,849 DEBUG : BROWSER_OUTPUT: RSS: Main: 356102144 22:05:36 INFO - 2015-11-02 22:05:36,849 DEBUG : BROWSER_OUTPUT: 22:08:38 INFO - 2015-11-02 22:08:38,806 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49730/tests/dromaeo/cssquery-prototype.html) 22:08:39 INFO - 2015-11-02 22:08:39,380 DEBUG : BROWSER_OUTPUT: RSS: Main: 311824384 22:08:39 INFO - 2015-11-02 22:08:39,380 DEBUG : BROWSER_OUTPUT: 22:11:42 INFO - 2015-11-02 22:11:42,544 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49730/tests/dromaeo/cssquery-yui.html) 22:11:43 INFO - 2015-11-02 22:11:43,157 DEBUG : BROWSER_OUTPUT: RSS: Main: 312721408 22:11:43 INFO - 2015-11-02 22:11:43,158 DEBUG : BROWSER_OUTPUT: 22:14:45 INFO - 2015-11-02 22:14:45,971 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/dromaeo/cssquery-yui.html (next: http://localhost:49730/tests/dromaeo/cssquery-dojo.html) 22:14:46 INFO - 2015-11-02 22:14:46,233 DEBUG : BROWSER_OUTPUT: RSS: Main: 402493440 22:14:46 INFO - 2015-11-02 22:14:46,234 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,234 DEBUG : BROWSER_OUTPUT: __start_tp_report 22:14:46 INFO - 2015-11-02 22:14:46,234 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 22:14:46 INFO - 2015-11-02 22:14:46,234 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 22:14:46 INFO - 2015-11-02 22:14:46,234 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 22:14:46 INFO - 2015-11-02 22:14:46,236 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3227.53200785886;3269.509573563964;3273.6562660920604;3285.2279714267156;3312.6356100828903;5195.792168313273;5428.37573679027;5476.17857321402;5482.7258637068135;5505.366882808473;5078.9746051269785;5337;5340;5368.973155134228;5388;4852.102361063197;4908.19014862549;4923.458419573844;4993.275974983625;5112.386513618352;5038.093143234217;5051.621128415365;5104.591632669396;5134.974325128369;5142.10013247682;4830.3237546743485;4937.6049916007;4950.925736113961;4962.106820772259;5016;4791.712497250176;4943.233798761198;4959.330490383788;4965.329680493123;4986.4764199758865;4919.754012299407;4924.285978533093;4959.330490383788;5028.396592408934;5045.293658887758;5157.510036546522;5177.689338639693;5273.789048438058;5293.153095504739;5299.682019078868;5539.861503462405;5582.748776305076;5614.466625670596;5620;5677.034904066319;5659.830205093854;5685.260916080924;5697.1739097831;5709.286339207599;5727.770889164429;5102.591792656653;5121.2574176744165;5312.389075256395;5340.359156901197;5361.973190134064;5711.914321285184;5787.768489260382;5809.82570522885;5833;5874.706264686749;5537.224788529609;5574.414686457863;5582.665040097607;5592.105263157957;5594.1608758686525;5552.416996215339;5621.15682647598;5675.489205971482;5676.176954341598;5739.13912913058;5487.6158668892795;5533.833984980457;5558;5559.749811258503;5588.161775733591;5470.890582188334;5478.726063696799;5499.037668408013;5500.834974950758;5578.832635020955;4342.044750154961;4362.149380870763;4426.380306757057;4429.53489883564;4479.843205487858;3940.231654827281;3946.131850992777;3993.980030099831;4073.3889916512762;4109.589041095866;5237.109691352403;5259.76331065103;5276.973615131899;5333.253344531769;5336.786528538815;5480.945190548044;5551.611387202938;5644.238027866268;5710.428957104256;5730.942690573041;5219;5237.450067742909;5258.053550360972;5271.341082364705;5292.550133238641;4895.045466134141;4928.556429921253;5003.574696150868;5030.396352437658;5094.6688465249645;5711.685857277889;5735.827925162252;5756.539476841843;5788.710564471759;5853.619514731528;5557.944420555743;5700.828975130753;5709.486146246858;5741.224934633771;5749.080147176432;5651.095824668033;5722.456366645162;5752.798652047159;5803.622764520293;5819.418058194146;5595.692236926845;5623.803166889303;5667.319921609434;5669.433056694297;5685.60200785941;5643.802466913638;5737.139429085503;5745.683987380734;5800.912986305125;5801.680907550125;5435.483629055233;5532.1425179097305;5538.695371754592;5544.528715059265;5569.916451253315;5348.171033489815;5558.416366281483;5563.638363506359;5565.193047008081;5572.108462645957;5233.528982391603;5344.572434205332;5377.381601115765;5475.288212532345;5525.861853453695;5369.436209197978;5474.835754927359;5494.917576236439;5529.723513824212;5543.9168412474655;5236.162214045735;5462.153366228241;5471.671699698031;5503.3395992481155;5507.173923911445 22:14:46 INFO - 2015-11-02 22:14:46,237 DEBUG : BROWSER_OUTPUT: |1;ext.html;554.8862483190949;556.0158519420626;558.6815515156361;562.4853259267765;571.5541877335679;31501.68498315016;32121.1969700757;32195.195120121978;32707.50938735918;38772.41841372382;42422.36366454498;42540.36189457161;42734.931626709345;43002.56997430025;43468.565314346924;8959.924809022927;9022.774430639238;9095.31785116119;9141.405808622452;9168.633254669805;8212.63043163059;8458.703945361913;8551.700690475835;9005.684801031965;9148.4968326742;8338.583070846464;8430.3255739541;8466.280366168883;11000;11375.886241137565;10955.50700218492;11090.445477726082;11138.777224455465;11166.162537809696;11269.436528173559;10737.24839261252;11049.834252486218;11068.723281917935;11085.72285692856;11120.888791112066;33534;34046.1488462788;40920.59079409228;42174.367384489255;42295.577044229474;3052.542118682193;3484.8257587120543;3505.2648938775214;3578.499010138583;3600.135967367839;25883.223503294932;25932.61101083485;26516.204513864614;26627.73372266272;26790;2325.5930212212793;2330.450250583377;2351.306364622423;2352.6235802271553;2431.538007778516;252999;254510;255244;255569;255709;56996;57564.71217643969;57582.13626795601;57720.07359116933;57989.4201057984;62516;62664.06003909945;63089;63291.683541581995;63304.36695633077;16451.25969331383;16983.575410614834;16985.91507042457;17038.659226815395;17212.39756608513;13005.414756335798;13066.54267100647;13155.342232888317;13172;13177.077604567588;18857.660924750766;19305.51736206606;19370.53747645373;19405.51486212828;19468;7905.367570594453;8133.715319963773;8155.755327340189;8196.590170491452;8234.629441675139;917.9541022948825;930.9767255818523;961.7259081161835;979;1066.6799960011965;27426.862865685544;28195.43609127847;28338;28422.573661395094;28515.57226641602;936.798588303518;994.6021591363368;1074.6399956014666;1086.6685660873509;1132.841402203692;14984.700305994038;15213.923930380277;15365.846341536666;15378.231088445533;15433.691326173413;295188;299348;303330;307819;312782;48120;48846.26730599044;48879;48967;49049.75475122601;1000.4697510319543;1270.2632473165543;1270.5680068776476;1397.0709478196886;1532.9386824527116;25946.61080083838;26334.473310534064;26459.735402646496;26537;26574.734252658;41787.58212417837;42313.78843105765;42372.1525569493;42409.36385954275;42527.14945701007;194233;194564;195325;197255;197708;30825;31049.689503105583;31503.21241968969;31751.68248317487;31776;40994.59005409908;41168;41748.165036699706;42225.155496890504;42373;34498.65501344954;34547;34665.48001779925;35138.648613513535;35190.29619407649;34301;34310;34732.47901281533;35014;35354.98965175875;35212.47181292231;35366.64633353634;35552.28895422129;36012;36114.27771444504;30094.84952575223;31256.843715781277;31280.374392512476;31373.372532548765;31577;23358.883205583865;23395.766042339357;23402.297931062094;23750.406239844142;23986.880065599562 22:14:46 INFO - 2015-11-02 22:14:46,241 DEBUG : BROWSER_OUTPUT: |2;jquery.html;331.56233771421734;336.3290235979222;338.6613386613387;342.6419391735637;346.9600995885474;14484.42062317506;14537.05509141905;17289.827101728977;17299.481015569538;17802.041775404712;14269.714605707906;15712.292946817392;18489.167987440564;18933.39066179373;19072.23711051556;5130.230465430178;5227.686338819683;5358.705271210082;5361.624686271963;5429.61992660512;3399.6090449598364;4591.196540605398;4698.859034228962;4715;4722.1972264714905;3436.914077148066;4642.396488456496;4770.30830529573;4778.498257682945;4849.515048495157;4729.2433210686295;4741.265103908882;4773.284007398918;4788.61691064714;4799.928001079987;3759.56764972029;3869.1101046759404;3936.586658400884;3951.585083566242;3962.484876966005;12582.68543286416;12806.167599106027;12883.613491595268;12915.160514566616;12978.221306721533;1766.611345503987;1828.3417969530958;1837.366108692499;1945.7956914524054;1993.2326054468988;9040.8643870342;9089.954550227272;9291.953540232324;9362.859557106582;9592.76018099553;1495.7158139953374;1546.4741987724115;1559.9298031588605;1582.2800625715272;1649.7937757780278;57645.711771441296;57854.42145578533;57899.42100578982;58606;59278.70360648212;6406.839829004312;6410.102585638015;6447.838804029843;6464.191976003;6477.805665830033;7315.890261646079;7349.595772232472;7416.3696085832225;7418.703251869865;7462.96268518654;5178.71517066565;5204.73976301191;5219.164933610604;5497.945020549823;5532.197831314437;5481.780728770885;5516.062269414209;5575.107982722745;5942.524598032147;5953.315368732565;2838.574213867895;2900.028490455721;2911.315840777458;2938.867750951212;2942.0438357533885;1010.3079390617451;1013.9138173255209;1014.8122597319519;1037.056278786301;1063.718219545446;356.4481570346659;419.4672765587687;429.9505556860938;445.63457964468824;446.5913688974617;11128.888711112786;11616.012638925786;11662.300261984308;11690.064794816395;11692.47383867728;451.41767120414954;454.3548161610521;456.8332558616081;459.132240066275;459.9287110497878;5478.506934375925;6131.816045518642;6205.906911396332;6259.1550140730415;6379.043143528415;544637;546362;555485;561292;564983;66057.6697116521;67775.32224677691;68022.65988670025;68118.3188168112;68452.657736711;506.8200788720025;511.5983952597193;511.79272394680214;512.1319363678604;512.3851378346;11084.16868734832;11145.665630030788;11196.552137914392;11249.718757030812;11341.829872552084;33294.33411331711;33639.795025621796;33804.492932606525;34070.318593628486;34178.82910585531;44660.55339446564;45072.77463612661;45105.774471127435;45983.54016459926;46201.768991156176;6239.937600623935;6259.624422534663;6322.747090116344;6334.144890439916;6415.262244841903;11061.281016733887;11701.941490292495;11780.882191177978;11785.88214117848;11870.940645296718;10064.547095380873;10181.74545636365;10188.592456301962;10208.642697505551;10209.285350025428;9575.856362154434;9892;9909.752256193653;9919.900800991898;9940.254480913816;9777.364471309342;10254.025867542572;10293;10313.071823535618;10346.741331466472;6165.5375846810775;6192.164057852132;6273.749050037947;6279.183706118175;6280.026595877646;9693.466859322805;10154.339967902062;10160.593576256866;10319.845202321821;10392.16862650971 22:14:46 INFO - 2015-11-02 22:14:46,241 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1235.7837378458767;1599.9680206266958;1630.1278815833527;1661.152812065846;1778.5375802291408;7036.085308909841;7230.421566274698;7316.158641756199;7447.851042979137;7639.770806875788;7482.588457634842;7677.654505547263;7691.42314326425;7695;7695.076590809111;2192.451887028239;2200.8349373797028;2218.1349273783158;2230.565039817236;2269.954600907981;2211.6019116559014;2222.2555443926303;2293.7247530296386;2296.357020034393;2307.14635584833;2204.713387259654;2219.8002179803816;2231.3306008197555;2238.0040881807604;2238.3620668109593;2161.297578287047;2175.912963481459;2185.7814218578096;2191.233068426054;2198.373463562885;2275.2946586558055;2275.84069115162;2277.89749461273;2278.931632051041;2283.1666441748644;6714.328567143295;7328.3770879475305;7568.167501574822;7573.356264717506;7578.280063394024;4246.193223287565;4557;4581.060882519076;4641.164590373765;4658.883527911829;2731.3444773254473;2776.8611569421446;2816.746492815636;2833.6316278883614;2839.0347281924037;843.5571325054334;865.8787769712245;877.6884206106868;906.854903215489;911.680911680913;9825.656102036466;9877.111060004563;9887.456189909552;9894.653687120988;9941.850872236922;4302.827886884552;4326.740395576213;4349.9130017399475;4376.037271800199;4419.447569053868;8746.912530874737;8767.824643507094;8794.516301603473;8794.692185773467;8812.295016398673;4799.784009719571;4801.567858892647;4806.975965120222;4832.782524786393;4847.079054979543;4383.60547550722;4388.2759344707765;4391.133768148524;4401.7358958461955;4406.1187762447635;3528.183716075126;3625.836837342326;3628.745987780883;3651.1784848408897;3671.889843304705;1145;1159.1538177130742;1168.118070856498;1168.1589255735857;1168.4975460552043;895.0557162193948;1107.7618312062946;1155.1394211312459;1224.8224007519038;1239.2626387299542;7040.225575186725;7235.529690570096;7322.231165727522;7334.523255988451;7339.77980660581;432.7446806384248;441.22564898602747;449.8403066911265;451.13832579773134;454.5817847580234;5506.284183056177;5646.6047376684055;5648.6893220872425;5669.092945128759;5744.4829965303325;8108.351331893435;8822;8974.551272436483;8979.46123232608;9007.504587247633;8731.694390696295;8830.984436789722;8880.955595221982;8890.64437422496;8966.148215919608;6890.689918953659;7029.121359830021;7070.8939365909555;7097.574145551283;7124.109486314107;6824.863502730017;6900.171979362308;6931.722731090902;6942.687579059056;7058.082449281561;7746.49647772893;8061.717839875576;8153.1846815317995;8173.346132309282;8206.58967051657;7828.882566761617;7998.520088794691;8096.39277054235;8112.75661730149;8140.837183256183;6686.1642294713165;6757.86484270302;6762.898556521558;6790.219124800514;6793.218779840382;7253;7288.96355518219;7316.378107860892;7329.596872171868;7342.926570734438;6598.637074960923;6789.72841086351;6825.317468253135;6899.89650155238;6922.7923162305215;6706.731730730716;6741.393274605309;6803.89794153098;6832.248452670302;6871.347222013901;6885.449164066762;6921.1002569665625;6927.618980956096;6961.930380696331;6987.231404545598;6294.15028971083;6335.271443784024;6343.365663433619;6365.045243213555;6393.552451328548;6369.1401660777055;6480.222373315044;6480.25477070143;6489.1888513935755;6519.3480651936325 22:14:46 INFO - 2015-11-02 22:14:46,243 DEBUG : BROWSER_OUTPUT: |4;prototype.html;315.9273367125561;317.5363968605835;319.2258772476743;320.7049514446709;328.87174002139164;5804.3905389934025;5864.530837532998;5978.521718262539;6003.099535069742;6037.154798328232;5862.618929769562;5905.793297234598;5910.527157827374;5936.821895343136;5951.851203719909;4494.325851122325;4572.771361431932;4694.319323698053;4697.953020469786;4700.7649617519155;4624.05206932578;4648.070385922829;4658.301254811789;4674.345591617176;4683.648726345537;4598.701084429518;4602.746848923308;4632.907341853161;4638.512956139607;4648.907021859561;4589.426321709786;4609.585137337655;4624.583787459112;4639.976800115995;4656.883577910546;3887.2225554889137;4008.478897743304;4011.7392369495888;4019.417184508259;4031.294523458383;5750.769969201227;5779.913301300484;5781.046127388976;5787.50806181475;5800.651960882361;5096.592272618219;5118.027574760821;5118.155504341779;5152.742362881841;5216.061109000379;5964.015937370329;6098.939010609882;6139.079138129272;6250.406211409909;6251.3123556408755;4194.475690538683;4238.724482908632;4270.252705776507;4274.252005898955;4289.506706728735;6468.353164683541;6513.869722605568;6529.31442198567;6568.6058836469965;6619.900701489433;4171.520275168334;4198.517170525368;4219.915601688011;4223.155368926227;4246.065865509583;4323.373110898902;4334.804933777988;4348.173846969065;4351.804168812348;4351.9564804352185;4857.854264372075;5033.270175824485;5034.320366750515;5063.772130254148;5099.949000509948;6174.845628859314;6190.102435146879;6208.875822483616;6209;6212.844678882973;1453.3605213706146;1528.6102043978715;1561.2818103672212;1567.3573834727706;1571.0181136789506;924.5377311344328;993.5926270229171;994.4580203788952;1004.6835246897203;1016.2733645443543;5828.6794226317115;5838.941610583925;5842.5618078644275;5850.736716847752;5851.444112809277;6393.424591786761;6405.583637063669;6412.35876412355;6414.422701956846;6417.358264173638;5685.118806584903;5831.94168058314;5841.591088623841;5842.152887831241;5884.617499862496;3587.3722098632634;3590.9461358079648;3610.4042832932273;3612.0428086557085;3631.4915911772373;6574.408303252731;6578.375054369827;6586.27550969393;6615.140031795836;6636.668166591651;6421.550491465552;6580.5064620152725;6647.933520664731;6675.532712710064;6691.799246022627;6533.509986751108;6583.967080164569;6598.571092878948;6606.075149479077;6618.4705223582;6487.318831522811;6490.448311893542;6496.220453545605;6504.804855854332;6541.836454088686;6259.374062593704;6409.134766806422;6419.261784894797;6423.132877061536;6426.646534440651;6627.37039981201;6628.502862285444;6634.137562116894;6650.501212409185;6651.667416629246;4259.808308626058;4302.935455968226;4307.547707490794;4319.676024298127;4321.416608757778;6454.19322584677;6476.643784591893;6479.384458476437;6493.707783149864;6502.512311576556;6095.939040609537;6131.019036954066;6145.9692701536205;6163.229596300463;6197.349278325892;6137.570370074052;6160.784372546939;6171.783987560414;6177.907331389943;6192.349803270772;5973.4325239103955;6010.368911264429;6042.093685947143;6054.455099041107;6072.1498990140535;5840.912386314294;6106.725197366218;6204.906926396198;6239.220097487814;6284.08880712285;6108.053251745987;6109.755609775737;6112.755489780359;6117.510599151969;6136.539759517965 22:14:46 INFO - 2015-11-02 22:14:46,246 DEBUG : BROWSER_OUTPUT: |5;yui.html;676.3169199108904;682.3654001778348;713.1869668577818;790.794393457701;792.9484583502071;13283.867161328408;13370.197788132708;13543.932280338597;13565.118267312642;13621.25083120428;13051.282179480124;13052.738945221114;13080.672983175402;13140.277284749334;13146.342682865843;690.3959035843637;716.6810769207705;876.1982785751046;884.663827745459;886.9201771840533;872.7905302727363;893.1559676106083;900.8648702694583;901.729481155654;904.9502277374742;897.4570384917129;901.985266575103;914.2548822709471;916.5325683901225;929.4144688846052;708.542989771597;730.6529398535706;903.2187158108255;923.0953665407905;924.9815003699956;672.9528932974694;676.3878689785703;677.9932200677979;678.081199974033;687.5702685821361;13306.534271300556;13527.797083043664;13545.255010974393;13547.864521354857;13561.050726449152;11565.88747508201;11604.709882252926;11666.650000499998;11721.531138754439;12125.39373031345;9132.315076369232;9206.723798286062;9212.953935230282;9345.252379809599;9891.554880030415;3303.8513266902805;3308.387948229585;3322.850471728778;3402.6767457091537;3455.8963231103107;44966.85232033759;45064.77467612674;45131.32303015458;45231.547684523066;45238;8625.913740862636;8785.253253473398;8855.73432797017;8975.192232699088;9027.909720902839;19083.61832763337;19203.423897283104;19241.4227573173;19417.417477475698;19423.125959331865;6910.2744211858035;6926.341997510229;6927.030215769796;7016;7173.6809435133455;3656.597774244831;3756.530433695788;3790.7915064671156;3809.904752381213;3836.3094642963974;2846.2030631423236;2879.6544414670375;2886.0620298403105;2887.2781804548863;2889.393227422223;418.1720194015805;431.42620314981;433.754928465416;435.118884259371;438.67099675243566;486.18168051487186;557.1698169727158;563.7716724726492;591.3524690463935;610.2737742086991;7648.1204661463535;7703;7765.961170194113;7833.960830195812;7952.920470795334;470.3673559063055;508.85751989443014;592.4283066840434;607.134832863177;607.9939200608026;3211.3737821125123;3470;3477.304539092141;3516.40221162403;3535.3106144301614;58568.414315856295;59135.40864591299;59335.70332148398;59521;59580.404195958356;49854;50407.49592504028;50408.74795626072;50574.747126264134;50946.74526627343;44066.11867762691;44089.559104409185;45164.322535162;45762;45802.5419745805;7354.191038985814;7361.668724907499;7438.62806859644;7561.130469996021;7673.61631918413;34096.82951585226;34171;34297.14257143492;34299.485507716905;34756.131096722784;42195.57804421917;42299.7885010573;44365.33451998158;46791.298130527386;47740.52259477361;8912.777180570538;9562.034356877686;9624.230061594915;9815.950920245354;10038.598456061967;10147.949260253947;10173.694789156338;10532.262741608014;10538.683839484827;10909.127269818555;9838.224510258728;9871.062249086326;9952.203823694232;10056.597736090474;10116.393016419039;9492.762680933032;9555.140037396668;9623.422594644344;9705.854412183682;9988.750281243027;9179;9334.579943902676;9421.152096311365;9606.423614583147;10020.09819116283;7846.901433799387;8024.799380015546;8052.83894322122;8361.498310101413;8496.447730897471;7668.501547399401;7914.327282181079;8392.286655634096;8659.48043117415;8744.431611945203 22:14:46 INFO - 2015-11-02 22:14:46,247 DEBUG : BROWSER_OUTPUT: __end_tp_report 22:14:46 INFO - 2015-11-02 22:14:46,247 DEBUG : BROWSER_OUTPUT: __start_cc_report 22:14:46 INFO - 2015-11-02 22:14:46,247 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,832 22:14:46 INFO - 2015-11-02 22:14:46,247 DEBUG : BROWSER_OUTPUT: __end_cc_report 22:14:46 INFO - 2015-11-02 22:14:46,247 DEBUG : BROWSER_OUTPUT: __startTimestamp1446531286232__endTimestamp 22:14:46 INFO - 2015-11-02 22:14:46,248 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,248 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 22:14:46 INFO - 2015-11-02 22:14:46,248 DEBUG : BROWSER_OUTPUT: Number of tests: 6 22:14:46 INFO - 2015-11-02 22:14:46,248 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,248 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5281.95 Median:5474.84 stddev:532.93 (9.7%) stddev-sans-first:509.61 22:14:46 INFO - 2015-11-02 22:14:46,248 DEBUG : BROWSER_OUTPUT: Values: 3227.5 3269.5 3273.7 3285.2 3312.6 5195.8 5428.4 5476.2 5482.7 5505.4 5079.0 5337.0 5340.0 5369.0 5388.0 4852.1 4908.2 4923.5 4993.3 5112.4 5038.1 5051.6 5104.6 5135.0 5142.1 4830.3 4937.6 4950.9 4962.1 5016.0 4791.7 4943.2 4959.3 4965.3 4986.5 4919.8 4924.3 4959.3 5028.4 5045.3 5157.5 5177.7 5273.8 5293.2 5299.7 5539.9 5582.7 5614.5 5620.0 5677.0 5659.8 5685.3 5697.2 5709.3 5727.8 5102.6 5121.3 5312.4 5340.4 5362.0 5711.9 5787.8 5809.8 5833.0 5874.7 5537.2 5574.4 5582.7 5592.1 5594.2 5552.4 5621.2 5675.5 5676.2 5739.1 5487.6 5533.8 5558.0 5559.7 5588.2 5470.9 5478.7 5499.0 5500.8 5578.8 4342.0 4362.1 4426.4 4429.5 4479.8 3940.2 3946.1 3994.0 4073.4 4109.6 5237.1 5259.8 5277.0 5333.3 5336.8 5480.9 5551.6 5644.2 5710.4 5730.9 5219.0 5237.5 5258.1 5271.3 5292.6 4895.0 4928.6 5003.6 5030.4 5094.7 5711.7 5735.8 5756.5 5788.7 5853.6 5557.9 5700.8 5709.5 5741.2 5749.1 5651.1 5722.5 5752.8 5803.6 5819.4 5595.7 5623.8 5667.3 5669.4 5685.6 5643.8 5737.1 5745.7 5800.9 5801.7 5435.5 5532.1 5538.7 5544.5 5569.9 5348.2 5558.4 5563.6 5565.2 5572.1 5233.5 5344.6 5377.4 5475.3 5525.9 5369.4 5474.8 5494.9 5529.7 5543.9 5236.2 5462.2 5471.7 5503.3 5507.2 22:14:46 INFO - 2015-11-02 22:14:46,249 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,249 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:42402.77 Median:31664.34 stddev:66537.92 (210.1%) stddev-sans-first:66650.39 22:14:46 INFO - 2015-11-02 22:14:46,249 DEBUG : BROWSER_OUTPUT: Values: 554.9 556.0 558.7 562.5 571.6 31501.7 32121.2 32195.2 32707.5 38772.4 42422.4 42540.4 42734.9 43002.6 43468.6 8959.9 9022.8 9095.3 9141.4 9168.6 8212.6 8458.7 8551.7 9005.7 9148.5 8338.6 8430.3 8466.3 11000.0 11375.9 10955.5 11090.4 11138.8 11166.2 11269.4 10737.2 11049.8 11068.7 11085.7 11120.9 33534.0 34046.1 40920.6 42174.4 42295.6 3052.5 3484.8 3505.3 3578.5 3600.1 25883.2 25932.6 26516.2 26627.7 26790.0 2325.6 2330.5 2351.3 2352.6 2431.5 252999.0 254510.0 255244.0 255569.0 255709.0 56996.0 57564.7 57582.1 57720.1 57989.4 62516.0 62664.1 63089.0 63291.7 63304.4 16451.3 16983.6 16985.9 17038.7 17212.4 13005.4 13066.5 13155.3 13172.0 13177.1 18857.7 19305.5 19370.5 19405.5 19468.0 7905.4 8133.7 8155.8 8196.6 8234.6 918.0 931.0 961.7 979.0 1066.7 27426.9 28195.4 28338.0 28422.6 28515.6 936.8 994.6 1074.6 1086.7 1132.8 14984.7 15213.9 15365.8 15378.2 15433.7 295188.0 299348.0 303330.0 307819.0 312782.0 48120.0 48846.3 48879.0 48967.0 49049.8 1000.5 1270.3 1270.6 1397.1 1532.9 25946.6 26334.5 26459.7 26537.0 26574.7 41787.6 42313.8 42372.2 42409.4 42527.1 194233.0 194564.0 195325.0 197255.0 197708.0 30825.0 31049.7 31503.2 31751.7 31776.0 40994.6 41168.0 41748.2 42225.2 42373.0 34498.7 34547.0 34665.5 35138.6 35190.3 34301.0 34310.0 34732.5 35014.0 35355.0 35212.5 35366.6 35552.3 36012.0 36114.3 30094.8 31256.8 31280.4 31373.4 31577.0 23358.9 23395.8 23402.3 23750.4 23986.9 22:14:46 INFO - 2015-11-02 22:14:46,249 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,249 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26823.00 Median:457.98 stddev:90758.76 (19817.1%) stddev-sans-first:90991.56 22:14:46 INFO - 2015-11-02 22:14:46,251 DEBUG : BROWSER_OUTPUT: Values: 331.6 336.3 338.7 342.6 347.0 14484.4 14537.1 17289.8 17299.5 17802.0 14269.7 15712.3 18489.2 18933.4 19072.2 5130.2 5227.7 5358.7 5361.6 5429.6 3399.6 4591.2 4698.9 4715.0 4722.2 3436.9 4642.4 4770.3 4778.5 4849.5 4729.2 4741.3 4773.3 4788.6 4799.9 3759.6 3869.1 3936.6 3951.6 3962.5 12582.7 12806.2 12883.6 12915.2 12978.2 1766.6 1828.3 1837.4 1945.8 1993.2 9040.9 9090.0 9292.0 9362.9 9592.8 1495.7 1546.5 1559.9 1582.3 1649.8 57645.7 57854.4 57899.4 58606.0 59278.7 6406.8 6410.1 6447.8 6464.2 6477.8 7315.9 7349.6 7416.4 7418.7 7463.0 5178.7 5204.7 5219.2 5497.9 5532.2 5481.8 5516.1 5575.1 5942.5 5953.3 2838.6 2900.0 2911.3 2938.9 2942.0 1010.3 1013.9 1014.8 1037.1 1063.7 356.4 419.5 430.0 445.6 446.6 11128.9 11616.0 11662.3 11690.1 11692.5 451.4 454.4 456.8 459.1 459.9 5478.5 6131.8 6205.9 6259.2 6379.0 544637.0 546362.0 555485.0 561292.0 564983.0 66057.7 67775.3 68022.7 68118.3 68452.7 506.8 511.6 511.8 512.1 512.4 11084.2 11145.7 11196.6 11249.7 11341.8 33294.3 33639.8 33804.5 34070.3 34178.8 44660.6 45072.8 45105.8 45983.5 46201.8 6239.9 6259.6 6322.7 6334.1 6415.3 11061.3 11701.9 11780.9 11785.9 11870.9 10064.5 10181.7 10188.6 10208.6 10209.3 9575.9 9892.0 9909.8 9919.9 9940.3 9777.4 10254.0 10293.0 10313.1 10346.7 6165.5 6192.2 6273.7 6279.2 6280.0 9693.5 10154.3 10160.6 10319.8 10392.2 22:14:46 INFO - 2015-11-02 22:14:46,251 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,251 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5275.69 Median:6696.45 stddev:2709.65 (40.5%) stddev-sans-first:2700.24 22:14:46 INFO - 2015-11-02 22:14:46,252 DEBUG : BROWSER_OUTPUT: Values: 1235.8 1600.0 1630.1 1661.2 1778.5 7036.1 7230.4 7316.2 7447.9 7639.8 7482.6 7677.7 7691.4 7695.0 7695.1 2192.5 2200.8 2218.1 2230.6 2270.0 2211.6 2222.3 2293.7 2296.4 2307.1 2204.7 2219.8 2231.3 2238.0 2238.4 2161.3 2175.9 2185.8 2191.2 2198.4 2275.3 2275.8 2277.9 2278.9 2283.2 6714.3 7328.4 7568.2 7573.4 7578.3 4246.2 4557.0 4581.1 4641.2 4658.9 2731.3 2776.9 2816.7 2833.6 2839.0 843.6 865.9 877.7 906.9 911.7 9825.7 9877.1 9887.5 9894.7 9941.9 4302.8 4326.7 4349.9 4376.0 4419.4 8746.9 8767.8 8794.5 8794.7 8812.3 4799.8 4801.6 4807.0 4832.8 4847.1 4383.6 4388.3 4391.1 4401.7 4406.1 3528.2 3625.8 3628.7 3651.2 3671.9 1145.0 1159.2 1168.1 1168.2 1168.5 895.1 1107.8 1155.1 1224.8 1239.3 7040.2 7235.5 7322.2 7334.5 7339.8 432.7 441.2 449.8 451.1 454.6 5506.3 5646.6 5648.7 5669.1 5744.5 8108.4 8822.0 8974.6 8979.5 9007.5 8731.7 8831.0 8881.0 8890.6 8966.1 6890.7 7029.1 7070.9 7097.6 7124.1 6824.9 6900.2 6931.7 6942.7 7058.1 7746.5 8061.7 8153.2 8173.3 8206.6 7828.9 7998.5 8096.4 8112.8 8140.8 6686.2 6757.9 6762.9 6790.2 6793.2 7253.0 7289.0 7316.4 7329.6 7342.9 6598.6 6789.7 6825.3 6899.9 6922.8 6706.7 6741.4 6803.9 6832.2 6871.3 6885.4 6921.1 6927.6 6961.9 6987.2 6294.2 6335.3 6343.4 6365.0 6393.6 6369.1 6480.2 6480.3 6489.2 6519.3 22:14:46 INFO - 2015-11-02 22:14:46,253 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,253 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5200.70 Median:5895.21 stddev:1568.25 (26.6%) stddev-sans-first:1529.19 22:14:46 INFO - 2015-11-02 22:14:46,254 DEBUG : BROWSER_OUTPUT: Values: 315.9 317.5 319.2 320.7 328.9 5804.4 5864.5 5978.5 6003.1 6037.2 5862.6 5905.8 5910.5 5936.8 5951.9 4494.3 4572.8 4694.3 4698.0 4700.8 4624.1 4648.1 4658.3 4674.3 4683.6 4598.7 4602.7 4632.9 4638.5 4648.9 4589.4 4609.6 4624.6 4640.0 4656.9 3887.2 4008.5 4011.7 4019.4 4031.3 5750.8 5779.9 5781.0 5787.5 5800.7 5096.6 5118.0 5118.2 5152.7 5216.1 5964.0 6098.9 6139.1 6250.4 6251.3 4194.5 4238.7 4270.3 4274.3 4289.5 6468.4 6513.9 6529.3 6568.6 6619.9 4171.5 4198.5 4219.9 4223.2 4246.1 4323.4 4334.8 4348.2 4351.8 4352.0 4857.9 5033.3 5034.3 5063.8 5099.9 6174.8 6190.1 6208.9 6209.0 6212.8 1453.4 1528.6 1561.3 1567.4 1571.0 924.5 993.6 994.5 1004.7 1016.3 5828.7 5838.9 5842.6 5850.7 5851.4 6393.4 6405.6 6412.4 6414.4 6417.4 5685.1 5831.9 5841.6 5842.2 5884.6 3587.4 3590.9 3610.4 3612.0 3631.5 6574.4 6578.4 6586.3 6615.1 6636.7 6421.6 6580.5 6647.9 6675.5 6691.8 6533.5 6584.0 6598.6 6606.1 6618.5 6487.3 6490.4 6496.2 6504.8 6541.8 6259.4 6409.1 6419.3 6423.1 6426.6 6627.4 6628.5 6634.1 6650.5 6651.7 4259.8 4302.9 4307.5 4319.7 4321.4 6454.2 6476.6 6479.4 6493.7 6502.5 6095.9 6131.0 6146.0 6163.2 6197.3 6137.6 6160.8 6171.8 6177.9 6192.3 5973.4 6010.4 6042.1 6054.5 6072.1 5840.9 6106.7 6204.9 6239.2 6284.1 6108.1 6109.8 6112.8 6117.5 6136.5 22:14:46 INFO - 2015-11-02 22:14:46,254 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,254 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13217.04 Median:29863.38 stddev:15899.24 (53.2%) stddev-sans-first:15915.95 22:14:46 INFO - 2015-11-02 22:14:46,254 DEBUG : BROWSER_OUTPUT: Values: 676.3 682.4 713.2 790.8 792.9 13283.9 13370.2 13543.9 13565.1 13621.3 13051.3 13052.7 13080.7 13140.3 13146.3 690.4 716.7 876.2 884.7 886.9 872.8 893.2 900.9 901.7 905.0 897.5 902.0 914.3 916.5 929.4 708.5 730.7 903.2 923.1 925.0 673.0 676.4 678.0 678.1 687.6 13306.5 13527.8 13545.3 13547.9 13561.1 11565.9 11604.7 11666.7 11721.5 12125.4 9132.3 9206.7 9213.0 9345.3 9891.6 3303.9 3308.4 3322.9 3402.7 3455.9 44966.9 45064.8 45131.3 45231.5 45238.0 8625.9 8785.3 8855.7 8975.2 9027.9 19083.6 19203.4 19241.4 19417.4 19423.1 6910.3 6926.3 6927.0 7016.0 7173.7 3656.6 3756.5 3790.8 3809.9 3836.3 2846.2 2879.7 2886.1 2887.3 2889.4 418.2 431.4 433.8 435.1 438.7 486.2 557.2 563.8 591.4 610.3 7648.1 7703.0 7766.0 7834.0 7952.9 470.4 508.9 592.4 607.1 608.0 3211.4 3470.0 3477.3 3516.4 3535.3 58568.4 59135.4 59335.7 59521.0 59580.4 49854.0 50407.5 50408.7 50574.7 50946.7 44066.1 44089.6 45164.3 45762.0 45802.5 7354.2 7361.7 7438.6 7561.1 7673.6 34096.8 34171.0 34297.1 34299.5 34756.1 42195.6 42299.8 44365.3 46791.3 47740.5 8912.8 9562.0 9624.2 9816.0 10038.6 10147.9 10173.7 10532.3 10538.7 10909.1 9838.2 9871.1 9952.2 10056.6 10116.4 9492.8 9555.1 9623.4 9705.9 9988.8 9179.0 9334.6 9421.2 9606.4 10020.1 7846.9 8024.8 8052.8 8361.5 8496.4 7668.5 7914.3 8392.3 8659.5 8744.4 22:14:46 INFO - 2015-11-02 22:14:46,255 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 22:14:46 INFO - 2015-11-02 22:14:46,255 DEBUG : BROWSER_OUTPUT: 22:14:46 INFO - 2015-11-02 22:14:46,950 INFO : Browser exited with error code: 0 22:14:46 INFO - 2015-11-02 22:14:46,978 INFO : Completed test dromaeo_css (00:18:34) 22:14:46 INFO - 2015-11-02 22:14:46,978 INFO : Starting test kraken 22:14:46 INFO - 2015-11-02 22:14:46,978 DEBUG : operating with platform_type : mac_ 22:14:46 INFO - 2015-11-02 22:14:46,979 INFO : Initialising browser for kraken test... 22:14:46 INFO - 2015-11-02 22:14:46,995 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/tmp2jIIKZ/profile http://localhost:49730/getInfo.html 22:14:49 INFO - 2015-11-02 22:14:49,192 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 22:14:49 INFO - 2015-11-02 22:14:49,192 DEBUG : BROWSER_OUTPUT: colorDepth:24 22:14:49 INFO - 2015-11-02 22:14:49,192 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 22:14:49 INFO - 2015-11-02 22:14:49,192 DEBUG : BROWSER_OUTPUT: __metrics 22:14:49 INFO - 2015-11-02 22:14:49,210 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 22:14:49 INFO - 2015-11-02 22:14:49,891 INFO : Browser initialized. 22:14:49 INFO - 2015-11-02 22:14:49,891 INFO : Running cycle 1/1 for kraken test... 22:14:49 INFO - 2015-11-02 22:14:49,892 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/tmp2jIIKZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 22:15:01 INFO - 2015-11-02 22:15:01,787 DEBUG : BROWSER_OUTPUT: RSS: Main: 221171712 22:15:01 INFO - 2015-11-02 22:15:01,787 DEBUG : BROWSER_OUTPUT: 22:15:04 INFO - 2015-11-02 22:15:04,381 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49730/tests/kraken/driver.html?testName=audio-beat-detection) 22:15:04 INFO - 2015-11-02 22:15:04,973 DEBUG : BROWSER_OUTPUT: RSS: Main: 278433792 22:15:04 INFO - 2015-11-02 22:15:04,973 DEBUG : BROWSER_OUTPUT: 22:15:07 INFO - 2015-11-02 22:15:07,614 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49730/tests/kraken/driver.html?testName=audio-dft) 22:15:08 INFO - 2015-11-02 22:15:08,193 DEBUG : BROWSER_OUTPUT: RSS: Main: 291950592 22:15:08 INFO - 2015-11-02 22:15:08,194 DEBUG : BROWSER_OUTPUT: 22:15:11 INFO - 2015-11-02 22:15:11,166 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49730/tests/kraken/driver.html?testName=audio-fft) 22:15:11 INFO - 2015-11-02 22:15:11,747 DEBUG : BROWSER_OUTPUT: RSS: Main: 273498112 22:15:11 INFO - 2015-11-02 22:15:11,748 DEBUG : BROWSER_OUTPUT: 22:15:13 INFO - 2015-11-02 22:15:13,744 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49730/tests/kraken/driver.html?testName=audio-oscillator) 22:15:14 INFO - 2015-11-02 22:15:14,333 DEBUG : BROWSER_OUTPUT: RSS: Main: 275771392 22:15:14 INFO - 2015-11-02 22:15:14,333 DEBUG : BROWSER_OUTPUT: 22:15:16 INFO - 2015-11-02 22:15:16,532 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49730/tests/kraken/driver.html?testName=imaging-gaussian-blur) 22:15:17 INFO - 2015-11-02 22:15:17,104 DEBUG : BROWSER_OUTPUT: RSS: Main: 276508672 22:15:17 INFO - 2015-11-02 22:15:17,104 DEBUG : BROWSER_OUTPUT: 22:15:20 INFO - 2015-11-02 22:15:20,141 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49730/tests/kraken/driver.html?testName=imaging-darkroom) 22:15:20 INFO - 2015-11-02 22:15:20,716 DEBUG : BROWSER_OUTPUT: RSS: Main: 277651456 22:15:20 INFO - 2015-11-02 22:15:20,716 DEBUG : BROWSER_OUTPUT: 22:15:23 INFO - 2015-11-02 22:15:23,866 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49730/tests/kraken/driver.html?testName=imaging-desaturate) 22:15:24 INFO - 2015-11-02 22:15:24,451 DEBUG : BROWSER_OUTPUT: RSS: Main: 276406272 22:15:24 INFO - 2015-11-02 22:15:24,451 DEBUG : BROWSER_OUTPUT: 22:15:27 INFO - 2015-11-02 22:15:27,319 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49730/tests/kraken/driver.html?testName=json-parse-financial) 22:15:27 INFO - 2015-11-02 22:15:27,897 DEBUG : BROWSER_OUTPUT: RSS: Main: 278523904 22:15:27 INFO - 2015-11-02 22:15:27,897 DEBUG : BROWSER_OUTPUT: 22:15:29 INFO - 2015-11-02 22:15:29,461 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49730/tests/kraken/driver.html?testName=json-stringify-tinderbox) 22:15:30 INFO - 2015-11-02 22:15:30,027 DEBUG : BROWSER_OUTPUT: RSS: Main: 310890496 22:15:30 INFO - 2015-11-02 22:15:30,027 DEBUG : BROWSER_OUTPUT: 22:15:31 INFO - 2015-11-02 22:15:31,833 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49730/tests/kraken/driver.html?testName=stanford-crypto-aes) 22:15:32 INFO - 2015-11-02 22:15:32,456 DEBUG : BROWSER_OUTPUT: RSS: Main: 312139776 22:15:32 INFO - 2015-11-02 22:15:32,456 DEBUG : BROWSER_OUTPUT: 22:15:34 INFO - 2015-11-02 22:15:34,544 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49730/tests/kraken/driver.html?testName=stanford-crypto-ccm) 22:15:35 INFO - 2015-11-02 22:15:35,131 DEBUG : BROWSER_OUTPUT: RSS: Main: 320978944 22:15:35 INFO - 2015-11-02 22:15:35,132 DEBUG : BROWSER_OUTPUT: 22:15:37 INFO - 2015-11-02 22:15:37,665 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49730/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 22:15:38 INFO - 2015-11-02 22:15:38,251 DEBUG : BROWSER_OUTPUT: RSS: Main: 322543616 22:15:38 INFO - 2015-11-02 22:15:38,251 DEBUG : BROWSER_OUTPUT: 22:15:40 INFO - 2015-11-02 22:15:40,844 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49730/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 22:15:41 INFO - 2015-11-02 22:15:41,420 DEBUG : BROWSER_OUTPUT: RSS: Main: 322412544 22:15:41 INFO - 2015-11-02 22:15:41,420 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,152 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49730/tests/kraken/driver.html?testName=ai-astar) 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: RSS: Main: 380485632 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: __start_tp_report 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: |0;ai-astar;107;109;103;107;109;107;108;107;99;108 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;158;129;153;165;125;151;150;124;167;127 22:15:43 INFO - 2015-11-02 22:15:43,417 DEBUG : BROWSER_OUTPUT: |2;audio-dft;162;161;162;163;163;163;163;163;163;160 22:15:43 INFO - 2015-11-02 22:15:43,418 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;84;84;87;68;69;69;80;82;66 22:15:43 INFO - 2015-11-02 22:15:43,418 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;101;97;139;90;89;89;132;89;89;137 22:15:43 INFO - 2015-11-02 22:15:43,418 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;121;114;114;121;115;114;120;115;121;114 22:15:43 INFO - 2015-11-02 22:15:43,418 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;125;125;124;124;124;125;125;125;125;125 22:15:43 INFO - 2015-11-02 22:15:43,418 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;101;99;102;100;101;99;101;102;101;100 22:15:43 INFO - 2015-11-02 22:15:43,418 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;58;58;58;57;57;57;58;66;56;56 22:15:43 INFO - 2015-11-02 22:15:43,418 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;67;66;66;66;67;66;66;67;67;67 22:15:43 INFO - 2015-11-02 22:15:43,418 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;85;87;85;87;87;87;84;85;90;90 22:15:43 INFO - 2015-11-02 22:15:43,419 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;123;125;123;121;122;125;123;125;124;125 22:15:43 INFO - 2015-11-02 22:15:43,419 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;152;152;150;154;139;137;149;149;146;139 22:15:43 INFO - 2015-11-02 22:15:43,419 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;70;70;71;70;71;70;70;74;69;71 22:15:43 INFO - 2015-11-02 22:15:43,419 DEBUG : BROWSER_OUTPUT: __end_tp_report 22:15:43 INFO - 2015-11-02 22:15:43,419 DEBUG : BROWSER_OUTPUT: __start_cc_report 22:15:43 INFO - 2015-11-02 22:15:43,419 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,912 22:15:43 INFO - 2015-11-02 22:15:43,419 DEBUG : BROWSER_OUTPUT: __end_cc_report 22:15:43 INFO - 2015-11-02 22:15:43,419 DEBUG : BROWSER_OUTPUT: __startTimestamp1446531343411__endTimestamp 22:15:43 INFO - 2015-11-02 22:15:43,420 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,420 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 22:15:43 INFO - 2015-11-02 22:15:43,420 DEBUG : BROWSER_OUTPUT: Number of tests: 14 22:15:43 INFO - 2015-11-02 22:15:43,420 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,420 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:106.40 Median:108.00 stddev:3.10 (2.9%) stddev-sans-first:3.28 22:15:43 INFO - 2015-11-02 22:15:43,420 DEBUG : BROWSER_OUTPUT: Values: 107.0 109.0 103.0 107.0 109.0 107.0 108.0 107.0 99.0 108.0 22:15:43 INFO - 2015-11-02 22:15:43,420 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,420 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:144.90 Median:152.00 stddev:16.99 (11.2%) stddev-sans-first:17.35 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: Values: 158.0 129.0 153.0 165.0 125.0 151.0 150.0 124.0 167.0 127.0 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:162.30 Median:163.00 stddev:1.06 (0.6%) stddev-sans-first:1.12 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: Values: 162.0 161.0 162.0 163.0 163.0 163.0 163.0 163.0 163.0 160.0 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:76.20 Median:81.00 stddev:7.97 (9.8%) stddev-sans-first:8.37 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: Values: 73.0 84.0 84.0 87.0 68.0 69.0 69.0 80.0 82.0 66.0 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,421 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.20 Median:89.00 stddev:21.70 (24.4%) stddev-sans-first:22.96 22:15:43 INFO - 2015-11-02 22:15:43,422 DEBUG : BROWSER_OUTPUT: Values: 101.0 97.0 139.0 90.0 89.0 89.0 132.0 89.0 89.0 137.0 22:15:43 INFO - 2015-11-02 22:15:43,422 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,422 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.50 stddev:3.35 (2.8%) stddev-sans-first:3.21 22:15:43 INFO - 2015-11-02 22:15:43,422 DEBUG : BROWSER_OUTPUT: Values: 121.0 114.0 114.0 121.0 115.0 114.0 120.0 115.0 121.0 114.0 22:15:43 INFO - 2015-11-02 22:15:43,422 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,422 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:124.70 Median:125.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 22:15:43 INFO - 2015-11-02 22:15:43,422 DEBUG : BROWSER_OUTPUT: Values: 125.0 125.0 124.0 124.0 124.0 125.0 125.0 125.0 125.0 125.0 22:15:43 INFO - 2015-11-02 22:15:43,422 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:100.60 Median:101.50 stddev:1.07 (1.1%) stddev-sans-first:1.13 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: Values: 101.0 99.0 102.0 100.0 101.0 99.0 101.0 102.0 101.0 100.0 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:58.10 Median:58.00 stddev:2.88 (5.0%) stddev-sans-first:3.06 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: Values: 58.0 58.0 58.0 57.0 57.0 57.0 58.0 66.0 56.0 56.0 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:66.50 Median:67.00 stddev:0.53 (0.8%) stddev-sans-first:0.53 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: Values: 67.0 66.0 66.0 66.0 67.0 66.0 66.0 67.0 67.0 67.0 22:15:43 INFO - 2015-11-02 22:15:43,423 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,424 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:86.70 Median:87.00 stddev:2.06 (2.4%) stddev-sans-first:2.09 22:15:43 INFO - 2015-11-02 22:15:43,424 DEBUG : BROWSER_OUTPUT: Values: 85.0 87.0 85.0 87.0 87.0 87.0 84.0 85.0 90.0 90.0 22:15:43 INFO - 2015-11-02 22:15:43,424 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,424 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:123.60 Median:124.50 stddev:1.43 (1.1%) stddev-sans-first:1.50 22:15:43 INFO - 2015-11-02 22:15:43,424 DEBUG : BROWSER_OUTPUT: Values: 123.0 125.0 123.0 121.0 122.0 125.0 123.0 125.0 124.0 125.0 22:15:43 INFO - 2015-11-02 22:15:43,424 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,424 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:146.70 Median:149.50 stddev:6.18 (4.1%) stddev-sans-first:6.25 22:15:43 INFO - 2015-11-02 22:15:43,424 DEBUG : BROWSER_OUTPUT: Values: 152.0 152.0 150.0 154.0 139.0 137.0 149.0 149.0 146.0 139.0 22:15:43 INFO - 2015-11-02 22:15:43,425 DEBUG : BROWSER_OUTPUT: 22:15:43 INFO - 2015-11-02 22:15:43,425 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.60 Median:70.50 stddev:1.35 (1.9%) stddev-sans-first:1.41 22:15:43 INFO - 2015-11-02 22:15:43,425 DEBUG : BROWSER_OUTPUT: Values: 70.0 70.0 71.0 70.0 71.0 70.0 70.0 74.0 69.0 71.0 22:15:43 INFO - 2015-11-02 22:15:43,425 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 22:15:43 INFO - 2015-11-02 22:15:43,425 DEBUG : BROWSER_OUTPUT: 22:15:44 INFO - 2015-11-02 22:15:44,062 INFO : Browser exited with error code: 0 22:15:44 INFO - 2015-11-02 22:15:44,111 INFO : Completed test kraken (00:00:57) 22:15:44 INFO - 2015-11-02 22:15:44,111 INFO : Starting test v8_7 22:15:44 INFO - 2015-11-02 22:15:44,111 DEBUG : operating with platform_type : mac_ 22:15:44 INFO - 2015-11-02 22:15:44,112 INFO : Initialising browser for v8_7 test... 22:15:44 INFO - 2015-11-02 22:15:44,127 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/tmp1wzX1H/profile http://localhost:49730/getInfo.html 22:15:46 INFO - 2015-11-02 22:15:46,265 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 22:15:46 INFO - 2015-11-02 22:15:46,266 DEBUG : BROWSER_OUTPUT: colorDepth:24 22:15:46 INFO - 2015-11-02 22:15:46,266 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 22:15:46 INFO - 2015-11-02 22:15:46,266 DEBUG : BROWSER_OUTPUT: __metrics 22:15:46 INFO - 2015-11-02 22:15:46,289 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 22:15:46 INFO - 2015-11-02 22:15:46,977 INFO : Browser initialized. 22:15:46 INFO - 2015-11-02 22:15:46,978 INFO : Running cycle 1/1 for v8_7 test... 22:15:46 INFO - 2015-11-02 22:15:46,978 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/T/tmp1wzX1H/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 22:15:58 INFO - 2015-11-02 22:15:58,803 DEBUG : BROWSER_OUTPUT: RSS: Main: 221274112 22:15:58 INFO - 2015-11-02 22:15:58,803 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,355 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49730/tests/v8_7/run.html (next: http://localhost:49730/tests/v8_7/run.html) 22:16:20 INFO - 2015-11-02 22:16:20,615 DEBUG : BROWSER_OUTPUT: RSS: Main: 669388800 22:16:20 INFO - 2015-11-02 22:16:20,615 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,615 DEBUG : BROWSER_OUTPUT: __start_tp_report 22:16:20 INFO - 2015-11-02 22:16:20,615 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: |0;Richards;166.30633627141194 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;199.48134849391582 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: |2;Encrypt;325.7328990228013 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5731.428571428572 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2053.388090349076 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: |5;Earley;936.3295880149813 22:16:20 INFO - 2015-11-02 22:16:20,616 DEBUG : BROWSER_OUTPUT: |6;Boyer;12974.358974358975 22:16:20 INFO - 2015-11-02 22:16:20,617 DEBUG : BROWSER_OUTPUT: |7;RegExp;30323.529411764706 22:16:20 INFO - 2015-11-02 22:16:20,617 DEBUG : BROWSER_OUTPUT: |8;Splay;621.52133580705 22:16:20 INFO - 2015-11-02 22:16:20,617 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;5797.687861271676 22:16:20 INFO - 2015-11-02 22:16:20,617 DEBUG : BROWSER_OUTPUT: __end_tp_report 22:16:20 INFO - 2015-11-02 22:16:20,617 DEBUG : BROWSER_OUTPUT: __startTimestamp1446531380607__endTimestamp 22:16:20 INFO - 2015-11-02 22:16:20,617 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,617 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 22:16:20 INFO - 2015-11-02 22:16:20,617 DEBUG : BROWSER_OUTPUT: Number of tests: 10 22:16:20 INFO - 2015-11-02 22:16:20,618 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,618 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:166.31 Median:166.31 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,618 DEBUG : BROWSER_OUTPUT: Values: 166.3 22:16:20 INFO - 2015-11-02 22:16:20,618 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,618 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:199.48 Median:199.48 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,618 DEBUG : BROWSER_OUTPUT: Values: 199.5 22:16:20 INFO - 2015-11-02 22:16:20,618 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,618 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:325.73 Median:325.73 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,619 DEBUG : BROWSER_OUTPUT: Values: 325.7 22:16:20 INFO - 2015-11-02 22:16:20,619 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,619 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5731.43 Median:5731.43 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,619 DEBUG : BROWSER_OUTPUT: Values: 5731.4 22:16:20 INFO - 2015-11-02 22:16:20,619 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,619 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2053.39 Median:2053.39 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,619 DEBUG : BROWSER_OUTPUT: Values: 2053.4 22:16:20 INFO - 2015-11-02 22:16:20,619 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,620 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:936.33 Median:936.33 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,620 DEBUG : BROWSER_OUTPUT: Values: 936.3 22:16:20 INFO - 2015-11-02 22:16:20,620 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,620 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12974.36 Median:12974.36 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,620 DEBUG : BROWSER_OUTPUT: Values: 12974.4 22:16:20 INFO - 2015-11-02 22:16:20,620 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,620 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:30323.53 Median:30323.53 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,620 DEBUG : BROWSER_OUTPUT: Values: 30323.5 22:16:20 INFO - 2015-11-02 22:16:20,621 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,621 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:621.52 Median:621.52 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,621 DEBUG : BROWSER_OUTPUT: Values: 621.5 22:16:20 INFO - 2015-11-02 22:16:20,621 DEBUG : BROWSER_OUTPUT: 22:16:20 INFO - 2015-11-02 22:16:20,621 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:5797.69 Median:5797.69 stddev:0.00 (0.0%) 22:16:20 INFO - 2015-11-02 22:16:20,621 DEBUG : BROWSER_OUTPUT: Values: 5797.7 22:16:20 INFO - 2015-11-02 22:16:20,621 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 22:16:20 INFO - 2015-11-02 22:16:20,622 DEBUG : BROWSER_OUTPUT: 22:16:21 INFO - 2015-11-02 22:16:21,269 INFO : Browser exited with error code: 0 22:16:21 INFO - 2015-11-02 22:16:21,289 INFO : Completed test v8_7 (00:00:37) 22:16:21 INFO - 2015-11-02 22:16:21,683 INFO : Completed test suite (00:20:09) 22:16:21 INFO - 2015-11-02 22:16:21,683 DEBUG : Working with test: dromaeo_css 22:16:21 INFO - 2015-11-02 22:16:21,683 DEBUG : Generating results file: dromaeo_css 22:16:21 INFO - 2015-11-02 22:16:21,684 DEBUG : Working with test: kraken 22:16:21 INFO - 2015-11-02 22:16:21,684 DEBUG : Generating results file: kraken 22:16:21 INFO - 2015-11-02 22:16:21,685 INFO : javascript benchmark 22:16:21 INFO - 2015-11-02 22:16:21,685 DEBUG : Working with test: v8_7 22:16:21 INFO - 2015-11-02 22:16:21,685 DEBUG : Generating results file: v8_7 22:16:21 INFO - 2015-11-02 22:16:21,685 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 22:16:21 INFO - 2015-11-02 22:16:21,764 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,63,55]] 22:16:21 INFO - 2015-11-02 22:16:21,764 DEBUG : process_Request line: dromaeo_css 6468.05 graph.html#tests=[[72,63,55]] 22:16:21 INFO - 2015-11-02 22:16:21,764 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 22:16:21 INFO - 2015-11-02 22:16:21,881 DEBUG : process_Request line: kraken 1489.40 graph.html#tests=[[232,63,55]] 22:16:21 INFO - 2015-11-02 22:16:21,881 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 22:16:22 INFO - 2015-11-02 22:16:22,008 DEBUG : process_Request line: v8_7 18065.30 graph.html#tests=[[230,63,55]] 22:16:22 INFO - 2015-11-02 22:16:22,009 INFO : javascript benchmark 22:16:22 INFO - 2015-11-02 22:16:22,011 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [331.56233771421734, 336.3290235979222, 338.6613386613387, 342.6419391735637, 346.9600995885474, 14484.42062317506, 14537.05509141905, 17289.827101728977, 17299.481015569538, 17802.041775404712, 14269.714605707906, 15712.292946817392, 18489.167987440564, 18933.39066179373, 19072.23711051556, 5130.230465430178, 5227.686338819683, 5358.705271210082, 5361.624686271963, 5429.61992660512, 3399.6090449598364, 4591.196540605398, 4698.859034228962, 4715.0, 4722.1972264714905, 3436.914077148066, 4642.396488456496, 4770.30830529573, 4778.498257682945, 4849.515048495157, 4729.2433210686295, 4741.265103908882, 4773.284007398918, 4788.61691064714, 4799.928001079987, 3759.56764972029, 3869.1101046759404, 3936.586658400884, 3951.585083566242, 3962.484876966005, 12582.68543286416, 12806.167599106027, 12883.613491595268, 12915.160514566616, 12978.221306721533, 1766.611345503987, 1828.3417969530958, 1837.366108692499, 1945.7956914524054, 1993.2326054468988, 9040.8643870342, 9089.954550227272, 9291.953540232324, 9362.859557106582, 9592.76018099553, 1495.7158139953374, 1546.4741987724115, 1559.9298031588605, 1582.2800625715272, 1649.7937757780278, 57645.711771441296, 57854.42145578533, 57899.42100578982, 58606.0, 59278.70360648212, 6406.839829004312, 6410.102585638015, 6447.838804029843, 6464.191976003, 6477.805665830033, 7315.890261646079, 7349.595772232472, 7416.3696085832225, 7418.703251869865, 7462.96268518654, 5178.71517066565, 5204.73976301191, 5219.164933610604, 5497.945020549823, 5532.197831314437, 5481.780728770885, 5516.062269414209, 5575.107982722745, 5942.524598032147, 5953.315368732565, 2838.574213867895, 2900.028490455721, 2911.315840777458, 2938.867750951212, 2942.0438357533885, 1010.3079390617451, 1013.9138173255209, 1014.8122597319519, 1037.056278786301, 1063.718219545446, 356.4481570346659, 419.4672765587687, 429.9505556860938, 445.63457964468824, 446.5913688974617, 11128.888711112786, 11616.012638925786, 11662.300261984308, 11690.064794816395, 11692.47383867728, 451.41767120414954, 454.3548161610521, 456.8332558616081, 459.132240066275, 459.9287110497878, 5478.506934375925, 6131.816045518642, 6205.906911396332, 6259.1550140730415, 6379.043143528415, 544637.0, 546362.0, 555485.0, 561292.0, 564983.0, 66057.6697116521, 67775.32224677691, 68022.65988670025, 68118.3188168112, 68452.657736711, 506.8200788720025, 511.5983952597193, 511.79272394680214, 512.1319363678604, 512.3851378346, 11084.16868734832, 11145.665630030788, 11196.552137914392, 11249.718757030812, 11341.829872552084, 33294.33411331711, 33639.795025621796, 33804.492932606525, 34070.318593628486, 34178.82910585531, 44660.55339446564, 45072.77463612661, 45105.774471127435, 45983.54016459926, 46201.768991156176, 6239.937600623935, 6259.624422534663, 6322.747090116344, 6334.144890439916, 6415.262244841903, 11061.281016733887, 11701.941490292495, 11780.882191177978, 11785.88214117848, 11870.940645296718, 10064.547095380873, 10181.74545636365, 10188.592456301962, 10208.642697505551, 10209.285350025428, 9575.856362154434, 9892.0, 9909.752256193653, 9919.900800991898, 9940.254480913816, 9777.364471309342, 10254.025867542572, 10293.0, 10313.071823535618, 10346.741331466472, 6165.5375846810775, 6192.164057852132, 6273.749050037947, 6279.183706118175, 6280.026595877646, 9693.466859322805, 10154.339967902062, 10160.593576256866, 10319.845202321821, 10392.16862650971], "dojo.html": [3227.53200785886, 3269.509573563964, 3273.6562660920604, 3285.2279714267156, 3312.6356100828903, 5195.792168313273, 5428.37573679027, 5476.17857321402, 5482.7258637068135, 5505.366882808473, 5078.9746051269785, 5337.0, 5340.0, 5368.973155134228, 5388.0, 4852.102361063197, 4908.19014862549, 4923.458419573844, 4993.275974983625, 5112.386513618352, 5038.093143234217, 5051.621128415365, 5104.591632669396, 5134.974325128369, 5142.10013247682, 4830.3237546743485, 4937.6049916007, 4950.925736113961, 4962.106820772259, 5016.0, 4791.712497250176, 4943.233798761198, 4959.330490383788, 4965.329680493123, 4986.4764199758865, 4919.754012299407, 4924.285978533093, 4959.330490383788, 5028.396592408934, 5045.293658887758, 5157.510036546522, 5177.689338639693, 5273.789048438058, 5293.153095504739, 5299.682019078868, 5539.861503462405, 5582.748776305076, 5614.466625670596, 5620.0, 5677.034904066319, 5659.830205093854, 5685.260916080924, 5697.1739097831, 5709.286339207599, 5727.770889164429, 5102.591792656653, 5121.2574176744165, 5312.389075256395, 5340.359156901197, 5361.973190134064, 5711.914321285184, 5787.768489260382, 5809.82570522885, 5833.0, 5874.706264686749, 5537.224788529609, 5574.414686457863, 5582.665040097607, 5592.105263157957, 5594.1608758686525, 5552.416996215339, 5621.15682647598, 5675.489205971482, 5676.176954341598, 5739.13912913058, 5487.6158668892795, 5533.833984980457, 5558.0, 5559.749811258503, 5588.161775733591, 5470.890582188334, 5478.726063696799, 5499.037668408013, 5500.834974950758, 5578.832635020955, 4342.044750154961, 4362.149380870763, 4426.380306757057, 4429.53489883564, 4479.843205487858, 3940.231654827281, 3946.131850992777, 3993.980030099831, 4073.3889916512762, 4109.589041095866, 5237.109691352403, 5259.76331065103, 5276.973615131899, 5333.253344531769, 5336.786528538815, 5480.945190548044, 5551.611387202938, 5644.238027866268, 5710.428957104256, 5730.942690573041, 5219.0, 5237.450067742909, 5258.053550360972, 5271.341082364705, 5292.550133238641, 4895.045466134141, 4928.556429921253, 5003.574696150868, 5030.396352437658, 5094.6688465249645, 5711.685857277889, 5735.827925162252, 5756.539476841843, 5788.710564471759, 5853.619514731528, 5557.944420555743, 5700.828975130753, 5709.486146246858, 5741.224934633771, 5749.080147176432, 5651.095824668033, 5722.456366645162, 5752.798652047159, 5803.622764520293, 5819.418058194146, 5595.692236926845, 5623.803166889303, 5667.319921609434, 5669.433056694297, 5685.60200785941, 5643.802466913638, 5737.139429085503, 5745.683987380734, 5800.912986305125, 5801.680907550125, 5435.483629055233, 5532.1425179097305, 5538.695371754592, 5544.528715059265, 5569.916451253315, 5348.171033489815, 5558.416366281483, 5563.638363506359, 5565.193047008081, 5572.108462645957, 5233.528982391603, 5344.572434205332, 5377.381601115765, 5475.288212532345, 5525.861853453695, 5369.436209197978, 5474.835754927359, 5494.917576236439, 5529.723513824212, 5543.9168412474655, 5236.162214045735, 5462.153366228241, 5471.671699698031, 5503.3395992481155, 5507.173923911445], "mootools.html": [1235.7837378458767, 1599.9680206266958, 1630.1278815833527, 1661.152812065846, 1778.5375802291408, 7036.085308909841, 7230.421566274698, 7316.158641756199, 7447.851042979137, 7639.770806875788, 7482.588457634842, 7677.654505547263, 7691.42314326425, 7695.0, 7695.076590809111, 2192.451887028239, 2200.8349373797028, 2218.1349273783158, 2230.565039817236, 2269.954600907981, 2211.6019116559014, 2222.2555443926303, 2293.7247530296386, 2296.357020034393, 2307.14635584833, 2204.713387259654, 2219.8002179803816, 2231.3306008197555, 2238.0040881807604, 2238.3620668109593, 2161.297578287047, 2175.912963481459, 2185.7814218578096, 2191.233068426054, 2198.373463562885, 2275.2946586558055, 2275.84069115162, 2277.89749461273, 2278.931632051041, 2283.1666441748644, 6714.328567143295, 7328.3770879475305, 7568.167501574822, 7573.356264717506, 7578.280063394024, 4246.193223287565, 4557.0, 4581.060882519076, 4641.164590373765, 4658.883527911829, 2731.3444773254473, 2776.8611569421446, 2816.746492815636, 2833.6316278883614, 2839.0347281924037, 843.5571325054334, 865.8787769712245, 877.6884206106868, 906.854903215489, 911.680911680913, 9825.656102036466, 9877.111060004563, 9887.456189909552, 9894.653687120988, 9941.850872236922, 4302.827886884552, 4326.740395576213, 4349.9130017399475, 4376.037271800199, 4419.447569053868, 8746.912530874737, 8767.824643507094, 8794.516301603473, 8794.692185773467, 8812.295016398673, 4799.784009719571, 4801.567858892647, 4806.975965120222, 4832.782524786393, 4847.079054979543, 4383.60547550722, 4388.2759344707765, 4391.133768148524, 4401.7358958461955, 4406.1187762447635, 3528.183716075126, 3625.836837342326, 3628.745987780883, 3651.1784848408897, 3671.889843304705, 1145.0, 1159.1538177130742, 1168.118070856498, 1168.1589255735857, 1168.4975460552043, 895.0557162193948, 1107.7618312062946, 1155.1394211312459, 1224.8224007519038, 1239.2626387299542, 7040.225575186725, 7235.529690570096, 7322.231165727522, 7334.523255988451, 7339.77980660581, 432.7446806384248, 441.22564898602747, 449.8403066911265, 451.13832579773134, 454.5817847580234, 5506.284183056177, 5646.6047376684055, 5648.6893220872425, 5669.092945128759, 5744.4829965303325, 8108.351331893435, 8822.0, 8974.551272436483, 8979.46123232608, 9007.504587247633, 8731.694390696295, 8830.984436789722, 8880.955595221982, 8890.64437422496, 8966.148215919608, 6890.689918953659, 7029.121359830021, 7070.8939365909555, 7097.574145551283, 7124.109486314107, 6824.863502730017, 6900.171979362308, 6931.722731090902, 6942.687579059056, 7058.082449281561, 7746.49647772893, 8061.717839875576, 8153.1846815317995, 8173.346132309282, 8206.58967051657, 7828.882566761617, 7998.520088794691, 8096.39277054235, 8112.75661730149, 8140.837183256183, 6686.1642294713165, 6757.86484270302, 6762.898556521558, 6790.219124800514, 6793.218779840382, 7253.0, 7288.96355518219, 7316.378107860892, 7329.596872171868, 7342.926570734438, 6598.637074960923, 6789.72841086351, 6825.317468253135, 6899.89650155238, 6922.7923162305215, 6706.731730730716, 6741.393274605309, 6803.89794153098, 6832.248452670302, 6871.347222013901, 6885.449164066762, 6921.1002569665625, 6927.618980956096, 6961.930380696331, 6987.231404545598, 6294.15028971083, 6335.271443784024, 6343.365663433619, 6365.045243213555, 6393.552451328548, 6369.1401660777055, 6480.222373315044, 6480.25477070143, 6489.1888513935755, 6519.3480651936325], "ext.html": [554.8862483190949, 556.0158519420626, 558.6815515156361, 562.4853259267765, 571.5541877335679, 31501.68498315016, 32121.1969700757, 32195.195120121978, 32707.50938735918, 38772.41841372382, 42422.36366454498, 42540.36189457161, 42734.931626709345, 43002.56997430025, 43468.565314346924, 8959.924809022927, 9022.774430639238, 9095.31785116119, 9141.405808622452, 9168.633254669805, 8212.63043163059, 8458.703945361913, 8551.700690475835, 9005.684801031965, 9148.4968326742, 8338.583070846464, 8430.3255739541, 8466.280366168883, 11000.0, 11375.886241137565, 10955.50700218492, 11090.445477726082, 11138.777224455465, 11166.162537809696, 11269.436528173559, 10737.24839261252, 11049.834252486218, 11068.723281917935, 11085.72285692856, 11120.888791112066, 33534.0, 34046.1488462788, 40920.59079409228, 42174.367384489255, 42295.577044229474, 3052.542118682193, 3484.8257587120543, 3505.2648938775214, 3578.499010138583, 3600.135967367839, 25883.223503294932, 25932.61101083485, 26516.204513864614, 26627.73372266272, 26790.0, 2325.5930212212793, 2330.450250583377, 2351.306364622423, 2352.6235802271553, 2431.538007778516, 252999.0, 254510.0, 255244.0, 255569.0, 255709.0, 56996.0, 57564.71217643969, 57582.13626795601, 57720.07359116933, 57989.4201057984, 62516.0, 62664.06003909945, 63089.0, 63291.683541581995, 63304.36695633077, 16451.25969331383, 16983.575410614834, 16985.91507042457, 17038.659226815395, 17212.39756608513, 13005.414756335798, 13066.54267100647, 13155.342232888317, 13172.0, 13177.077604567588, 18857.660924750766, 19305.51736206606, 19370.53747645373, 19405.51486212828, 19468.0, 7905.367570594453, 8133.715319963773, 8155.755327340189, 8196.590170491452, 8234.629441675139, 917.9541022948825, 930.9767255818523, 961.7259081161835, 979.0, 1066.6799960011965, 27426.862865685544, 28195.43609127847, 28338.0, 28422.573661395094, 28515.57226641602, 936.798588303518, 994.6021591363368, 1074.6399956014666, 1086.6685660873509, 1132.841402203692, 14984.700305994038, 15213.923930380277, 15365.846341536666, 15378.231088445533, 15433.691326173413, 295188.0, 299348.0, 303330.0, 307819.0, 312782.0, 48120.0, 48846.26730599044, 48879.0, 48967.0, 49049.75475122601, 1000.4697510319543, 1270.2632473165543, 1270.5680068776476, 1397.0709478196886, 1532.9386824527116, 25946.61080083838, 26334.473310534064, 26459.735402646496, 26537.0, 26574.734252658, 41787.58212417837, 42313.78843105765, 42372.1525569493, 42409.36385954275, 42527.14945701007, 194233.0, 194564.0, 195325.0, 197255.0, 197708.0, 30825.0, 31049.689503105583, 31503.21241968969, 31751.68248317487, 31776.0, 40994.59005409908, 41168.0, 41748.165036699706, 42225.155496890504, 42373.0, 34498.65501344954, 34547.0, 34665.48001779925, 35138.648613513535, 35190.29619407649, 34301.0, 34310.0, 34732.47901281533, 35014.0, 35354.98965175875, 35212.47181292231, 35366.64633353634, 35552.28895422129, 36012.0, 36114.27771444504, 30094.84952575223, 31256.843715781277, 31280.374392512476, 31373.372532548765, 31577.0, 23358.883205583865, 23395.766042339357, 23402.297931062094, 23750.406239844142, 23986.880065599562], "prototype.html": [315.9273367125561, 317.5363968605835, 319.2258772476743, 320.7049514446709, 328.87174002139164, 5804.3905389934025, 5864.530837532998, 5978.521718262539, 6003.099535069742, 6037.154798328232, 5862.618929769562, 5905.793297234598, 5910.527157827374, 5936.821895343136, 5951.851203719909, 4494.325851122325, 4572.771361431932, 4694.319323698053, 4697.953020469786, 4700.7649617519155, 4624.05206932578, 4648.070385922829, 4658.301254811789, 4674.345591617176, 4683.648726345537, 4598.701084429518, 4602.746848923308, 4632.907341853161, 4638.512956139607, 4648.907021859561, 4589.426321709786, 4609.585137337655, 4624.583787459112, 4639.976800115995, 4656.883577910546, 3887.2225554889137, 4008.478897743304, 4011.7392369495888, 4019.417184508259, 4031.294523458383, 5750.769969201227, 5779.913301300484, 5781.046127388976, 5787.50806181475, 5800.651960882361, 5096.592272618219, 5118.027574760821, 5118.155504341779, 5152.742362881841, 5216.061109000379, 5964.015937370329, 6098.939010609882, 6139.079138129272, 6250.406211409909, 6251.3123556408755, 4194.475690538683, 4238.724482908632, 4270.252705776507, 4274.252005898955, 4289.506706728735, 6468.353164683541, 6513.869722605568, 6529.31442198567, 6568.6058836469965, 6619.900701489433, 4171.520275168334, 4198.517170525368, 4219.915601688011, 4223.155368926227, 4246.065865509583, 4323.373110898902, 4334.804933777988, 4348.173846969065, 4351.804168812348, 4351.9564804352185, 4857.854264372075, 5033.270175824485, 5034.320366750515, 5063.772130254148, 5099.949000509948, 6174.845628859314, 6190.102435146879, 6208.875822483616, 6209.0, 6212.844678882973, 1453.3605213706146, 1528.6102043978715, 1561.2818103672212, 1567.3573834727706, 1571.0181136789506, 924.5377311344328, 993.5926270229171, 994.4580203788952, 1004.6835246897203, 1016.2733645443543, 5828.6794226317115, 5838.941610583925, 5842.5618078644275, 5850.736716847752, 5851.444112809277, 6393.424591786761, 6405.583637063669, 6412.35876412355, 6414.422701956846, 6417.358264173638, 5685.118806584903, 5831.94168058314, 5841.591088623841, 5842.152887831241, 5884.617499862496, 3587.3722098632634, 3590.9461358079648, 3610.4042832932273, 3612.0428086557085, 3631.4915911772373, 6574.408303252731, 6578.375054369827, 6586.27550969393, 6615.140031795836, 6636.668166591651, 6421.550491465552, 6580.5064620152725, 6647.933520664731, 6675.532712710064, 6691.799246022627, 6533.509986751108, 6583.967080164569, 6598.571092878948, 6606.075149479077, 6618.4705223582, 6487.318831522811, 6490.448311893542, 6496.220453545605, 6504.804855854332, 6541.836454088686, 6259.374062593704, 6409.134766806422, 6419.261784894797, 6423.132877061536, 6426.646534440651, 6627.37039981201, 6628.502862285444, 6634.137562116894, 6650.501212409185, 6651.667416629246, 4259.808308626058, 4302.935455968226, 4307.547707490794, 4319.676024298127, 4321.416608757778, 6454.19322584677, 6476.643784591893, 6479.384458476437, 6493.707783149864, 6502.512311576556, 6095.939040609537, 6131.019036954066, 6145.9692701536205, 6163.229596300463, 6197.349278325892, 6137.570370074052, 6160.784372546939, 6171.783987560414, 6177.907331389943, 6192.349803270772, 5973.4325239103955, 6010.368911264429, 6042.093685947143, 6054.455099041107, 6072.1498990140535, 5840.912386314294, 6106.725197366218, 6204.906926396198, 6239.220097487814, 6284.08880712285, 6108.053251745987, 6109.755609775737, 6112.755489780359, 6117.510599151969, 6136.539759517965], "yui.html": [676.3169199108904, 682.3654001778348, 713.1869668577818, 790.794393457701, 792.9484583502071, 13283.867161328408, 13370.197788132708, 13543.932280338597, 13565.118267312642, 13621.25083120428, 13051.282179480124, 13052.738945221114, 13080.672983175402, 13140.277284749334, 13146.342682865843, 690.3959035843637, 716.6810769207705, 876.1982785751046, 884.663827745459, 886.9201771840533, 872.7905302727363, 893.1559676106083, 900.8648702694583, 901.729481155654, 904.9502277374742, 897.4570384917129, 901.985266575103, 914.2548822709471, 916.5325683901225, 929.4144688846052, 708.542989771597, 730.6529398535706, 903.2187158108255, 923.0953665407905, 924.9815003699956, 672.9528932974694, 676.3878689785703, 677.9932200677979, 678.081199974033, 687.5702685821361, 13306.534271300556, 13527.797083043664, 13545.255010974393, 13547.864521354857, 13561.050726449152, 11565.88747508201, 11604.709882252926, 11666.650000499998, 11721.531138754439, 12125.39373031345, 9132.315076369232, 9206.723798286062, 9212.953935230282, 9345.252379809599, 9891.554880030415, 3303.8513266902805, 3308.387948229585, 3322.850471728778, 3402.6767457091537, 3455.8963231103107, 44966.85232033759, 45064.77467612674, 45131.32303015458, 45231.547684523066, 45238.0, 8625.913740862636, 8785.253253473398, 8855.73432797017, 8975.192232699088, 9027.909720902839, 19083.61832763337, 19203.423897283104, 19241.4227573173, 19417.417477475698, 19423.125959331865, 6910.2744211858035, 6926.341997510229, 6927.030215769796, 7016.0, 7173.6809435133455, 3656.597774244831, 3756.530433695788, 3790.7915064671156, 3809.904752381213, 3836.3094642963974, 2846.2030631423236, 2879.6544414670375, 2886.0620298403105, 2887.2781804548863, 2889.393227422223, 418.1720194015805, 431.42620314981, 433.754928465416, 435.118884259371, 438.67099675243566, 486.18168051487186, 557.1698169727158, 563.7716724726492, 591.3524690463935, 610.2737742086991, 7648.1204661463535, 7703.0, 7765.961170194113, 7833.960830195812, 7952.920470795334, 470.3673559063055, 508.85751989443014, 592.4283066840434, 607.134832863177, 607.9939200608026, 3211.3737821125123, 3470.0, 3477.304539092141, 3516.40221162403, 3535.3106144301614, 58568.414315856295, 59135.40864591299, 59335.70332148398, 59521.0, 59580.404195958356, 49854.0, 50407.49592504028, 50408.74795626072, 50574.747126264134, 50946.74526627343, 44066.11867762691, 44089.559104409185, 45164.322535162, 45762.0, 45802.5419745805, 7354.191038985814, 7361.668724907499, 7438.62806859644, 7561.130469996021, 7673.61631918413, 34096.82951585226, 34171.0, 34297.14257143492, 34299.485507716905, 34756.131096722784, 42195.57804421917, 42299.7885010573, 44365.33451998158, 46791.298130527386, 47740.52259477361, 8912.777180570538, 9562.034356877686, 9624.230061594915, 9815.950920245354, 10038.598456061967, 10147.949260253947, 10173.694789156338, 10532.262741608014, 10538.683839484827, 10909.127269818555, 9838.224510258728, 9871.062249086326, 9952.203823694232, 10056.597736090474, 10116.393016419039, 9492.762680933032, 9555.140037396668, 9623.422594644344, 9705.854412183682, 9988.750281243027, 9179.0, 9334.579943902676, 9421.152096311365, 9606.423614583147, 10020.09819116283, 7846.901433799387, 8024.799380015546, 8052.83894322122, 8361.498310101413, 8496.447730897471, 7668.501547399401, 7914.327282181079, 8392.286655634096, 8659.48043117415, 8744.431611945203]}, "summary": {"suite": 6468.050781866436, "subtests": {"jquery.html": {"filtered": 6617.379106581596, "value": 6617.379106581596}, "dojo.html": {"filtered": 5250.663797170292, "value": 5250.663797170292}, "mootools.html": {"filtered": 4258.916780735368, "value": 4258.916780735368}, "ext.html": {"filtered": 17981.159805130195, "value": 17981.159805130195}, "prototype.html": {"filtered": 4680.78206031574, "value": 4680.78206031574}, "yui.html": {"filtered": 5878.503391577188, "value": 5878.503391577188}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0041"}, "testrun": {"date": 1446530172, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151102204908", "branch": "Mozilla-Inbound", "revision": "7b99659430b166a6bb42129cd3cb5d48cd0e3f56"}}, {"talos_counters": {}, "results": {"audio-dft": [162.0, 161.0, 162.0, 163.0, 163.0, 163.0, 163.0, 163.0, 163.0, 160.0], "ai-astar": [107.0, 109.0, 103.0, 107.0, 109.0, 107.0, 108.0, 107.0, 99.0, 108.0], "imaging-gaussian-blur": [121.0, 114.0, 114.0, 121.0, 115.0, 114.0, 120.0, 115.0, 121.0, 114.0], "audio-beat-detection": [158.0, 129.0, 153.0, 165.0, 125.0, 151.0, 150.0, 124.0, 167.0, 127.0], "json-stringify-tinderbox": [67.0, 66.0, 66.0, 66.0, 67.0, 66.0, 66.0, 67.0, 67.0, 67.0], "stanford-crypto-pbkdf2": [152.0, 152.0, 150.0, 154.0, 139.0, 137.0, 149.0, 149.0, 146.0, 139.0], "json-parse-financial": [58.0, 58.0, 58.0, 57.0, 57.0, 57.0, 58.0, 66.0, 56.0, 56.0], "stanford-crypto-sha256-iterative": [70.0, 70.0, 71.0, 70.0, 71.0, 70.0, 70.0, 74.0, 69.0, 71.0], "audio-fft": [73.0, 84.0, 84.0, 87.0, 68.0, 69.0, 69.0, 80.0, 82.0, 66.0], "imaging-darkroom": [125.0, 125.0, 124.0, 124.0, 124.0, 125.0, 125.0, 125.0, 125.0, 125.0], "stanford-crypto-ccm": [123.0, 125.0, 123.0, 121.0, 122.0, 125.0, 123.0, 125.0, 124.0, 125.0], "audio-oscillator": [101.0, 97.0, 139.0, 90.0, 89.0, 89.0, 132.0, 89.0, 89.0, 137.0], "stanford-crypto-aes": [85.0, 87.0, 85.0, 87.0, 87.0, 87.0, 84.0, 85.0, 90.0, 90.0], "imaging-desaturate": [101.0, 99.0, 102.0, 100.0, 101.0, 99.0, 101.0, 102.0, 101.0, 100.0]}, "summary": {"suite": 1489.4, "subtests": {"audio-fft": {"filtered": 76.2, "value": 76.2}, "stanford-crypto-pbkdf2": {"filtered": 146.7, "value": 146.7}, "audio-beat-detection": {"filtered": 144.9, "value": 144.9}, "stanford-crypto-ccm": {"filtered": 123.6, "value": 123.6}, "imaging-darkroom": {"filtered": 124.7, "value": 124.7}, "json-parse-financial": {"filtered": 58.1, "value": 58.1}, "audio-oscillator": {"filtered": 105.2, "value": 105.2}, "ai-astar": {"filtered": 106.4, "value": 106.4}, "audio-dft": {"filtered": 162.3, "value": 162.3}, "stanford-crypto-sha256-iterative": {"filtered": 70.6, "value": 70.6}, "json-stringify-tinderbox": {"filtered": 66.5, "value": 66.5}, "imaging-gaussian-blur": {"filtered": 116.9, "value": 116.9}, "stanford-crypto-aes": {"filtered": 86.7, "value": 86.7}, "imaging-desaturate": {"filtered": 100.6, "value": 100.6}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0041"}, "testrun": {"date": 1446530172, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151102204908", "branch": "Mozilla-Inbound", "revision": "7b99659430b166a6bb42129cd3cb5d48cd0e3f56"}}, {"talos_counters": {}, "results": {"DeltaBlue": [199.48134849391582], "Encrypt": [325.7328990228013], "NavierStokes": [5797.687861271676], "Decrypt": [5731.428571428572], "Splay": [621.52133580705], "Richards": [166.30633627141194], "RegExp": [30323.529411764706], "Earley": [936.3295880149813], "Boyer": [12974.358974358975], "RayTrace": [2053.388090349076]}, "summary": {"suite": 18065.302665111598, "subtests": {"DeltaBlue": {"filtered": 331.4495339999999, "value": 331.4495339999999}, "Encrypt": {"filtered": 817.1756700000001, "value": 817.1756700000001}, "NavierStokes": {"filtered": 255.96410767696923, "value": 255.96410767696923}, "Decrypt": {"filtered": 46.44234795613162, "value": 46.44234795613162}, "Splay": {"filtered": 131.11537014925372, "value": 131.11537014925372}, "RegExp": {"filtered": 30.042182347235716, "value": 30.042182347235716}, "Richards": {"filtered": 212.27092600000003, "value": 212.27092600000003}, "Earley": {"filtered": 711.7824839999997, "value": 711.7824839999997}, "Boyer": {"filtered": 51.367701581027646, "value": 51.367701581027646}, "RayTrace": {"filtered": 360.37464300000005, "value": 360.37464300000005}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0041"}, "testrun": {"date": 1446530172, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151102204908", "branch": "Mozilla-Inbound", "revision": "7b99659430b166a6bb42129cd3cb5d48cd0e3f56"}}] 22:16:22 INFO - RETURN: dromaeo_css: 6468.05 22:16:22 INFO - RETURN: kraken: 1489.40 22:16:22 INFO - RETURN: v8_7: 18065.30 22:16:22 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,63,55]]", "result": "18065.30"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,63,55]]", "result": "1489.40"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,63,55]]", "result": "6468.05"}}} 22:16:22 INFO - Return code: 0 22:16:22 INFO - # TBPL SUCCESS # 22:16:22 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 22:16:22 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 22:16:22 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 22:16:22 INFO - 2015-11-02 22:16:22.138 screenresolution[1963:15308] starting screenresolution argv=screenresolution get 22:16:22 INFO - 2015-11-02 22:16:22.142 screenresolution[1963:15308] Display 0: 1600x1200x32@60 22:16:22 INFO - 2015-11-02 22:16:22.148 screenresolution[1964:15312] starting screenresolution argv=screenresolution list 22:16:22 INFO - Available Modes on Display 0 22:16:22 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 22:16:22 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 22:16:22 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 22:16:22 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 22:16:22 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 22:16:22 INFO - Intel HD Graphics 3000: 22:16:22 INFO - Chipset Model: Intel HD Graphics 3000 22:16:22 INFO - Type: GPU 22:16:22 INFO - Bus: Built-In 22:16:22 INFO - VRAM (Total): 512 MB 22:16:22 INFO - VRAM (Dynamic, Max): 10 22:16:22 INFO - Vendor: Intel (0x8086) 22:16:22 INFO - Device ID: 0x0116 22:16:22 INFO - Revision ID: 0x0009 22:16:22 INFO - Displays: 22:16:22 INFO - Display: 22:16:22 INFO - Resolution: 1600 x 1200 @ 60 Hz 22:16:22 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 22:16:22 INFO - Display Serial Number: 1600x1200 60 22:16:22 INFO - Main Display: Yes 22:16:22 INFO - Mirror: Off 22:16:22 INFO - Online: Yes 22:16:22 INFO - Rotation: Supported 22:16:22 INFO - Return code: 0 22:16:22 INFO - Running post-action listener: _resource_record_post_action 22:16:22 INFO - Running post-run listener: _resource_record_post_run 22:16:23 INFO - Total resource usage - Wall time: 1248s; CPU: 30.0%; Read bytes: 180224; Write bytes: 686983168; Read time: 130; Write time: 86122 22:16:23 INFO - install - Wall time: 38s; CPU: 30.0%; Read bytes: 342002176; Write bytes: 343209984; Read time: 33331; Write time: 7958 22:16:23 INFO - run-tests - Wall time: 1211s; CPU: 30.0%; Read bytes: 135168; Write bytes: 340529152; Read time: 101; Write time: 77207 22:16:23 INFO - Running post-run listener: _upload_blobber_files 22:16:23 INFO - Blob upload gear active. 22:16:23 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 22:16:23 INFO - Copying logs to upload dir... 22:16:23 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1306.349713 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 46 secs) (at 2015-11-02 22:16:23.561512) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-02 22:16:23.564903) ========= 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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners TMPDIR=/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010315 build_url: 'https://queue.taskcluster.net/v1/task/D3TFshkbQVG-oY-uothkKQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-02 22:16:23.592300) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-02 22:16:23.592745) ========= 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.RbO52Cy5dJ/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.zY5Qx5Nfao/Listeners TMPDIR=/var/folders/5c/0lxxktl96kngt1wtsc3fpdfm00000w/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.005224 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-02 22:16:23.642676) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-02 22:16:23.643074) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-02 22:16:23.643738) ========= ========= Total master_lag: 0.27 =========