builder: mozilla-inbound_yosemite_test-dromaeojs slave: t-yosemite-r5-0015 starttime: 1446695140.98 results: success (0) buildid: 20151104182235 builduid: 60bcb8104e1b4f7fb4b9530a4c1863c5 revision: 3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:40.984090) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:40.984466) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:40.984765) ========= 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.KfY59TyE88/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.GnEQWQ1eu7/Listeners TMPDIR=/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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.005830 basedir: '/builds/slave/test' ========= master_lag: 0.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.041535) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.041825) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.116369) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.116668) ========= 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.KfY59TyE88/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.GnEQWQ1eu7/Listeners TMPDIR=/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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.005463 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.172866) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.173144) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.173483) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.173773) ========= 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.KfY59TyE88/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.GnEQWQ1eu7/Listeners TMPDIR=/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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-04 19:45:41-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102, :: Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 386M=0s 2015-11-04 19:45:41 (386 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.397744 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.586534) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.586843) ========= 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.KfY59TyE88/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.GnEQWQ1eu7/Listeners TMPDIR=/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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.019732 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.638022) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:41.638329) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166 --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 3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.KfY59TyE88/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.GnEQWQ1eu7/Listeners TMPDIR=/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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-04 19:45:41,710 truncating revision to first 12 chars 2015-11-04 19:45:41,711 Setting DEBUG logging. 2015-11-04 19:45:41,711 attempt 1/10 2015-11-04 19:45:41,711 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/3111b73e96d8?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-04 19:45:42,020 unpacking tar archive at: mozilla-inbound-3111b73e96d8/testing/mozharness/ program finished with exit code 0 elapsedTime=0.554827 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:42.210882) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:42.211188) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:42.224330) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:42.224754) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-04 19:45:42.225236) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 2 secs) (at 2015-11-04 19:45:42.225525) ========= /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.KfY59TyE88/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.GnEQWQ1eu7/Listeners TMPDIR=/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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 19:45:42 INFO - MultiFileLogger online at 20151104 19:45:42 in /builds/slave/test 19:45:42 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 19:45:42 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 19:45:42 INFO - {'append_to_log': False, 19:45:42 INFO - 'base_work_dir': '/builds/slave/test', 19:45:42 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 19:45:42 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 19:45:42 INFO - 'branch': 'Mozilla-Inbound', 19:45:42 INFO - 'buildbot_json_path': 'buildprops.json', 19:45:42 INFO - 'config_files': ('talos/mac_config.py',), 19:45:42 INFO - 'default_actions': ('clobber', 19:45:42 INFO - 'read-buildbot-config', 19:45:42 INFO - 'download-and-extract', 19:45:42 INFO - 'populate-webroot', 19:45:42 INFO - 'create-virtualenv', 19:45:42 INFO - 'install', 19:45:42 INFO - 'run-tests'), 19:45:42 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:45:42 INFO - 'download_minidump_stackwalk': True, 19:45:42 INFO - 'download_symbols': 'ondemand', 19:45:42 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:45:42 INFO - 'tooltool.py': '/tools/tooltool.py', 19:45:42 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:45:42 INFO - '/tools/misc-python/virtualenv.py')}, 19:45:42 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:45:42 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:45:42 INFO - 'installer_path': 'installer.exe', 19:45:42 INFO - 'log_level': 'info', 19:45:42 INFO - 'log_name': 'talos', 19:45:42 INFO - 'log_to_console': True, 19:45:42 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 19:45:42 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 19:45:42 INFO - 'opt_config_files': (), 19:45:42 INFO - 'pip_index': False, 19:45:42 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 19:45:42 INFO - 'cmd': ('bash', 19:45:42 INFO - '-c', 19:45:42 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 19:45:42 INFO - 'enabled': True, 19:45:42 INFO - 'halt_on_failure': False, 19:45:42 INFO - 'name': 'check_screen_resolution'},), 19:45:42 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 19:45:42 INFO - 'cmd': ('bash', 19:45:42 INFO - '-c', 19:45:42 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 19:45:42 INFO - 'enabled': True, 19:45:42 INFO - 'halt_on_failure': False, 19:45:42 INFO - 'name': 'check_screen_resolution'},), 19:45:42 INFO - 'run_cmd_checks_enabled': True, 19:45:42 INFO - 'sps_profile': False, 19:45:42 INFO - 'sps_profile_interval': 0, 19:45:42 INFO - 'suite': 'dromaeojs', 19:45:42 INFO - 'system_bits': '64', 19:45:42 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:45:42 INFO - 'title': 't-yosemite-r5-0015', 19:45:42 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:45:42 INFO - 'use_talos_json': True, 19:45:42 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 19:45:42 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:45:42 INFO - 'work_dir': 'build'} 19:45:42 INFO - ##### 19:45:42 INFO - ##### Running clobber step. 19:45:42 INFO - ##### 19:45:42 INFO - Running pre-action listener: _resource_record_pre_action 19:45:42 INFO - Running main action method: clobber 19:45:42 INFO - rmtree: /builds/slave/test/build 19:45:42 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 19:45:45 INFO - Running post-action listener: _resource_record_post_action 19:45:45 INFO - ##### 19:45:45 INFO - ##### Running read-buildbot-config step. 19:45:45 INFO - ##### 19:45:45 INFO - Running pre-action listener: _resource_record_pre_action 19:45:45 INFO - Running main action method: read_buildbot_config 19:45:45 INFO - Using buildbot properties: 19:45:45 INFO - { 19:45:45 INFO - "properties": { 19:45:45 INFO - "buildnumber": 3020, 19:45:45 INFO - "product": "firefox", 19:45:45 INFO - "script_repo_revision": "production", 19:45:45 INFO - "builddir": "mozilla-inbound_yosemite_test-dromaeojs", 19:45:45 INFO - "repository": "", 19:45:45 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 mozilla-inbound talos dromaeojs", 19:45:45 INFO - "buildid": "20151104182235", 19:45:45 INFO - "slavename": "t-yosemite-r5-0015", 19:45:45 INFO - "pgo_build": "False", 19:45:45 INFO - "basedir": "/builds/slave/test", 19:45:45 INFO - "project": "", 19:45:45 INFO - "platform": "yosemite", 19:45:45 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 19:45:45 INFO - "slavebuilddir": "test", 19:45:45 INFO - "scheduler": "tests-mozilla-inbound-macosx64-talos", 19:45:45 INFO - "branch": "mozilla-inbound", 19:45:45 INFO - "repo_path": "integration/mozilla-inbound", 19:45:45 INFO - "stage_platform": "macosx64", 19:45:45 INFO - "builduid": "60bcb8104e1b4f7fb4b9530a4c1863c5", 19:45:45 INFO - "revision": "3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166" 19:45:45 INFO - }, 19:45:45 INFO - "sourcestamp": { 19:45:45 INFO - "repository": "", 19:45:45 INFO - "hasPatch": false, 19:45:45 INFO - "project": "", 19:45:45 INFO - "branch": "mozilla-inbound-macosx64-talos", 19:45:45 INFO - "changes": [ 19:45:45 INFO - { 19:45:45 INFO - "category": null, 19:45:45 INFO - "files": [ 19:45:45 INFO - { 19:45:45 INFO - "url": null, 19:45:45 INFO - "name": "https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 19:45:45 INFO - } 19:45:45 INFO - ], 19:45:45 INFO - "repository": "", 19:45:45 INFO - "rev": "3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166", 19:45:45 INFO - "who": "gwright@mozilla.com", 19:45:45 INFO - "when": 1446695107, 19:45:45 INFO - "number": 6622935, 19:45:45 INFO - "comments": "Bug 1111892 - Ensure gdk_ungrab_pointer is always called in the correct process r=jimm", 19:45:45 INFO - "project": "", 19:45:45 INFO - "at": "Wed 04 Nov 2015 19:45:07", 19:45:45 INFO - "branch": "mozilla-inbound-macosx64-talos", 19:45:45 INFO - "revlink": "", 19:45:45 INFO - "properties": [ 19:45:45 INFO - [ 19:45:45 INFO - "buildid", 19:45:45 INFO - "20151104182235", 19:45:45 INFO - "Change" 19:45:45 INFO - ], 19:45:45 INFO - [ 19:45:45 INFO - "builduid", 19:45:45 INFO - "60bcb8104e1b4f7fb4b9530a4c1863c5", 19:45:45 INFO - "Change" 19:45:45 INFO - ], 19:45:45 INFO - [ 19:45:45 INFO - "pgo_build", 19:45:45 INFO - "False", 19:45:45 INFO - "Change" 19:45:45 INFO - ] 19:45:45 INFO - ], 19:45:45 INFO - "revision": "3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166" 19:45:45 INFO - } 19:45:45 INFO - ], 19:45:45 INFO - "revision": "3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166" 19:45:45 INFO - } 19:45:45 INFO - } 19:45:45 INFO - Found installer url https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 19:45:45 INFO - Running post-action listener: _resource_record_post_action 19:45:45 INFO - ##### 19:45:45 INFO - ##### Running download-and-extract step. 19:45:45 INFO - ##### 19:45:45 INFO - Running pre-action listener: _resource_record_pre_action 19:45:45 INFO - Running main action method: download_and_extract 19:45:45 INFO - mkdir: /builds/slave/test/build/tests 19:45:45 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')]} 19:45:45 INFO - https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 19:45:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/test_packages.json 19:45:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/test_packages.json 19:45:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 19:45:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 19:45:50 INFO - Downloaded 1149 bytes. 19:45:50 INFO - Reading from file /builds/slave/test/build/test_packages.json 19:45:50 INFO - Using the following test package requirements: 19:45:50 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 19:45:50 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:45:50 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 19:45:50 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:45:50 INFO - u'jsshell-mac.zip'], 19:45:50 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:45:50 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 19:45:50 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 19:45:50 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:45:50 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 19:45:50 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:45:50 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 19:45:50 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:45:50 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 19:45:50 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 19:45:50 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:45:50 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 19:45:50 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 19:45:50 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')]} 19:45:50 INFO - https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 19:45:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:45:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:45:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/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 19:45:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/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 19:45:57 INFO - Downloaded 17458599 bytes. 19:45:57 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 19:45:57 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:45:57 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 19:46:01 INFO - Return code: 0 19:46:01 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 19:46:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:01 INFO - https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 19:46:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:46:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:46:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/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 19:46:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/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 19:46:03 INFO - Downloaded 17458599 bytes. 19:46:03 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 19:46:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:46:03 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 19:46:08 INFO - Return code: 0 19:46:08 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')]} 19:46:08 INFO - https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 19:46:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 19:46:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 19:46:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/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 19:46:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/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 19:46:10 INFO - Downloaded 11131307 bytes. 19:46:10 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 19:46:10 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 19:46:10 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 19:46:10 INFO - Return code: 0 19:46: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')]} 19:46:10 INFO - https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 19:46:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 19:46:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 19:46:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 19:46:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/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 19:46:14 INFO - Downloaded 108694844 bytes. 19:46:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 19:46:14 INFO - mkdir: /builds/slave/test/properties 19:46:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 19:46:14 INFO - Writing to file /builds/slave/test/properties/build_url 19:46:14 INFO - Contents: 19:46:14 INFO - build_url:https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 19:46:14 INFO - Running post-action listener: _resource_record_post_action 19:46:14 INFO - Running post-action listener: set_extra_try_arguments 19:46:14 INFO - ##### 19:46:14 INFO - ##### Running populate-webroot step. 19:46:14 INFO - ##### 19:46:14 INFO - Running pre-action listener: _resource_record_pre_action 19:46:14 INFO - Running main action method: populate_webroot 19:46:14 INFO - Guessing talos json url... 19:46: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')]} 19:46:14 INFO - https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt matches https://queue.taskcluster.net 19:46:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 19:46:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 19:46:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.txt to /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 19:46:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xQ32SVkJSXmq9CxyATc3JQ/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 19:46:14 INFO - Downloaded 111 bytes. 19:46:14 INFO - Reading from file /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 19:46:14 INFO - Contents: 19:46:14 INFO - 20151104182235 19:46:14 INFO - https://hg.mozilla.org/integration/mozilla-inbound/rev/3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166 19:46: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')]} 19:46:14 INFO - trying https://hg.mozilla.org/integration/mozilla-inbound/raw-file/3111b73e96/testing/talos/talos.json 19:46:14 INFO - Downloading https://hg.mozilla.org/integration/mozilla-inbound/raw-file/3111b73e96/testing/talos/talos.json to /builds/slave/test/build/talos.json 19:46:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/integration/mozilla-inbound/raw-file/3111b73e96/testing/talos/talos.json', 'file_name': '/builds/slave/test/build/talos.json'}, attempt #1 19:46:15 INFO - Downloaded 4264 bytes. 19:46:15 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:46:15 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:46:15 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 19:46:15 INFO - '../fennec_ids.txt'], 19:46:15 INFO - 'tests': ['tcheck2']}, 19:46:15 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:46:15 INFO - '--tppagecycles', 19:46:15 INFO - '7'], 19:46:15 INFO - 'tests': ['tsvgm']}}, 19:46:15 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 19:46:15 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:46:15 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:46:15 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:46:15 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:46:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:46:15 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:46:15 INFO - 'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:46:15 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:46:15 INFO - 'tests': ['damp', 'tps']}, 19:46:15 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:46:15 INFO - 'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['damp', 'tps']}, 19:46:15 INFO - 'g3': {'tests': ['dromaeo_dom']}, 19:46:15 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:46:15 INFO - 'other': {'tests': ['a11yr', 19:46:15 INFO - 'ts_paint', 19:46:15 INFO - 'tpaint', 19:46:15 INFO - 'sessionrestore', 19:46:15 INFO - 'sessionrestore_no_auto_restore']}, 19:46:15 INFO - 'other-e10s': {'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['a11yr', 19:46:15 INFO - 'ts_paint', 19:46:15 INFO - 'tpaint', 19:46:15 INFO - 'sessionrestore', 19:46:15 INFO - 'sessionrestore_no_auto_restore']}, 19:46:15 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['a11yr', 19:46:15 INFO - 'ts_paint', 19:46:15 INFO - 'tpaint', 19:46:15 INFO - 'sessionrestore', 19:46:15 INFO - 'sessionrestore_no_auto_restore']}, 19:46:15 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['a11yr', 19:46:15 INFO - 'ts_paint', 19:46:15 INFO - 'tpaint', 19:46:15 INFO - 'sessionrestore', 19:46:15 INFO - 'sessionrestore_no_auto_restore']}, 19:46:15 INFO - 'other_l64': {'tests': ['a11yr', 19:46:15 INFO - 'ts_paint', 19:46:15 INFO - 'tpaint', 19:46:15 INFO - 'sessionrestore', 19:46:15 INFO - 'sessionrestore_no_auto_restore']}, 19:46:15 INFO - 'other_nol64': {'tests': ['a11yr', 19:46:15 INFO - 'ts_paint', 19:46:15 INFO - 'tpaint', 19:46:15 INFO - 'sessionrestore', 19:46:15 INFO - 'sessionrestore_no_auto_restore']}, 19:46:15 INFO - 'svgr': {'tests': ['tsvgx', 19:46:15 INFO - 'tsvgr_opacity', 19:46:15 INFO - 'tart', 19:46:15 INFO - 'tscrollx', 19:46:15 INFO - 'cart']}, 19:46:15 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['tsvgx', 19:46:15 INFO - 'tsvgr_opacity', 19:46:15 INFO - 'tart', 19:46:15 INFO - 'tscrollx', 19:46:15 INFO - 'cart']}, 19:46:15 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:46:15 INFO - 'tests': ['tp5o']}, 19:46:15 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:46:15 INFO - 'talos_options': ['--e10s'], 19:46:15 INFO - 'tests': ['tp5o']}, 19:46:15 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:46:15 INFO - 'talos_options': ['--xperf_path', 19:46:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:46:15 INFO - 'tests': ['tp5n']}, 19:46:15 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:46:15 INFO - 'talos_options': ['--e10s', 19:46:15 INFO - '--xperf_path', 19:46:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 19:46:15 INFO - 'C:/slave/talos-data/talos/xperf.config'], 19:46:15 INFO - 'tests': ['tp5n']}}, 19:46:15 INFO - 'talos.zip': {'path': '', 19:46:15 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:46:15 INFO - Running post-action listener: _resource_record_post_action 19:46:15 INFO - ##### 19:46:15 INFO - ##### Running create-virtualenv step. 19:46:15 INFO - ##### 19:46:15 INFO - Running pre-action listener: _resource_record_pre_action 19:46:15 INFO - Running main action method: create_virtualenv 19:46:15 INFO - Creating virtualenv /builds/slave/test/build/venv 19:46:15 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 19:46:15 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 19:46:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:46:15 INFO - Using real prefix '/tools/python27' 19:46:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 19:46:16 INFO - Installing distribute.............................................................................................................................................................................................done. 19:46:19 INFO - Installing pip.................done. 19:46:19 INFO - Return code: 0 19:46:19 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 19:46:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:46:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:46:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:19 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 0x1009fea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a6b228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8c1acd8250>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009b39f0>, '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 0x100712cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10097d990>, '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.KfY59TyE88/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.GnEQWQ1eu7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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 19:46:19 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 19:46:19 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 19:46:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.KfY59TyE88/Render', 19:46:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:46:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:46:19 INFO - 'HOME': '/Users/cltbld', 19:46:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:46:19 INFO - 'LOGNAME': 'cltbld', 19:46:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:46:19 INFO - 'MOZ_NO_REMOTE': '1', 19:46:19 INFO - 'NO_EM_RESTART': '1', 19:46:19 INFO - 'PAGER': '/bin/cat', 19:46:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:46:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:46:19 INFO - 'PWD': '/builds/slave/test', 19:46:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:46:19 INFO - 'SHELL': '/bin/bash', 19:46:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GnEQWQ1eu7/Listeners', 19:46:19 INFO - 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/', 19:46:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:46:19 INFO - 'USER': 'cltbld', 19:46:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:46:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:46:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:46:19 INFO - 'XPC_FLAGS': '0x0', 19:46:19 INFO - 'XPC_SERVICE_NAME': '0', 19:46:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:46:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:46:19 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 19:46:19 INFO - Cleaning up... 19:46:19 INFO - Return code: 0 19:46:19 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 19:46:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:46:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:46:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:19 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 0x1009fea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a6b228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8c1acd8250>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009b39f0>, '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 0x100712cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10097d990>, '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.KfY59TyE88/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.GnEQWQ1eu7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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 19:46:19 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 19:46:19 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 19:46:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.KfY59TyE88/Render', 19:46:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:46:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:46:19 INFO - 'HOME': '/Users/cltbld', 19:46:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:46:19 INFO - 'LOGNAME': 'cltbld', 19:46:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:46:19 INFO - 'MOZ_NO_REMOTE': '1', 19:46:19 INFO - 'NO_EM_RESTART': '1', 19:46:19 INFO - 'PAGER': '/bin/cat', 19:46:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:46:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:46:19 INFO - 'PWD': '/builds/slave/test', 19:46:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:46:19 INFO - 'SHELL': '/bin/bash', 19:46:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GnEQWQ1eu7/Listeners', 19:46:19 INFO - 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/', 19:46:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:46:19 INFO - 'USER': 'cltbld', 19:46:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:46:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:46:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:46:19 INFO - 'XPC_FLAGS': '0x0', 19:46:19 INFO - 'XPC_SERVICE_NAME': '0', 19:46:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:46:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:46:20 INFO - Downloading/unpacking psutil>=0.7.1 19:46: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 19:46: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 19:46: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 19:46: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 19:46: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 19:46: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 19:46:22 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 19:46:22 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 19:46:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 19:46:22 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:46:22 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:46:22 INFO - Installing collected packages: psutil 19:46:22 INFO - Running setup.py install for psutil 19:46:22 INFO - building 'psutil._psutil_osx' extension 19:46:22 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 19:46:23 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 19:46:23 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 19:46:23 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 19:46:23 INFO - building 'psutil._psutil_posix' extension 19:46:23 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 19:46:23 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 19:46:23 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 19:46:23 INFO - ^ 19:46:23 INFO - 1 warning generated. 19:46:23 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 19:46:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:46:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:46:23 INFO - Successfully installed psutil 19:46:23 INFO - Cleaning up... 19:46:23 INFO - Return code: 0 19:46:23 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 19:46:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:46:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:46:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:23 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 0x1009fea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a6b228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8c1acd8250>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009b39f0>, '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 0x100712cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10097d990>, '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.KfY59TyE88/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.GnEQWQ1eu7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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 19:46:23 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 19:46:23 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 19:46:23 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.KfY59TyE88/Render', 19:46:23 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:46:23 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:46:23 INFO - 'HOME': '/Users/cltbld', 19:46:23 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:46:23 INFO - 'LOGNAME': 'cltbld', 19:46:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:46:23 INFO - 'MOZ_NO_REMOTE': '1', 19:46:23 INFO - 'NO_EM_RESTART': '1', 19:46:23 INFO - 'PAGER': '/bin/cat', 19:46:23 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:46:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:46:23 INFO - 'PWD': '/builds/slave/test', 19:46:23 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:46:23 INFO - 'SHELL': '/bin/bash', 19:46:23 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GnEQWQ1eu7/Listeners', 19:46:23 INFO - 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/', 19:46:23 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:46:23 INFO - 'USER': 'cltbld', 19:46:23 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:46:23 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:46:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:46:23 INFO - 'XPC_FLAGS': '0x0', 19:46:23 INFO - 'XPC_SERVICE_NAME': '0', 19:46:23 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:46:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:46:23 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 19:46:23 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 19:46:23 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 19:46:23 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 19:46:23 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 19:46:23 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 19:46:23 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 19:46:26 INFO - Downloading mozsystemmonitor-0.0.tar.gz 19:46:26 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 19:46:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:46:26 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 19:46:26 INFO - Installing collected packages: mozsystemmonitor 19:46:26 INFO - Running setup.py install for mozsystemmonitor 19:46:26 INFO - Successfully installed mozsystemmonitor 19:46:26 INFO - Cleaning up... 19:46:26 INFO - Return code: 0 19:46:26 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 19:46:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:46:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:46:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:26 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 0x1009fea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a6b228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8c1acd8250>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009b39f0>, '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 0x100712cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10097d990>, '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.KfY59TyE88/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.GnEQWQ1eu7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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 19:46:26 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 19:46:26 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 19:46:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.KfY59TyE88/Render', 19:46:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:46:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:46:26 INFO - 'HOME': '/Users/cltbld', 19:46:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:46:26 INFO - 'LOGNAME': 'cltbld', 19:46:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:46:26 INFO - 'MOZ_NO_REMOTE': '1', 19:46:26 INFO - 'NO_EM_RESTART': '1', 19:46:26 INFO - 'PAGER': '/bin/cat', 19:46:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:46:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:46:26 INFO - 'PWD': '/builds/slave/test', 19:46:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:46:26 INFO - 'SHELL': '/bin/bash', 19:46:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GnEQWQ1eu7/Listeners', 19:46:26 INFO - 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/', 19:46:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:46:26 INFO - 'USER': 'cltbld', 19:46:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:46:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:46:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:46:26 INFO - 'XPC_FLAGS': '0x0', 19:46:26 INFO - 'XPC_SERVICE_NAME': '0', 19:46:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:46:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:46:26 INFO - Downloading/unpacking blobuploader==1.2.4 19:46:26 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 19:46:26 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 19:46:26 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 19:46:26 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 19:46:26 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 19:46:26 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 19:46:29 INFO - Downloading blobuploader-1.2.4.tar.gz 19:46:29 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 19:46:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:46:29 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:46:29 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 19:46:29 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 19:46:29 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 19:46:29 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 19:46:29 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 19:46:29 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 19:46:29 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 19:46:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 19:46:29 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:46:29 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 19:46:29 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 19:46:29 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 19:46:29 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 19:46:29 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 19:46:29 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 19:46:30 INFO - Downloading docopt-0.6.1.tar.gz 19:46:30 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 19:46:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 19:46:30 INFO - Installing collected packages: blobuploader, requests, docopt 19:46:30 INFO - Running setup.py install for blobuploader 19:46:30 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:46:30 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 19:46:30 INFO - Running setup.py install for requests 19:46:31 INFO - Running setup.py install for docopt 19:46:31 INFO - Successfully installed blobuploader requests docopt 19:46:31 INFO - Cleaning up... 19:46:31 INFO - Return code: 0 19:46:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:46:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:46:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:46:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:46:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:31 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 0x1009fea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a6b228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8c1acd8250>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009b39f0>, '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 0x100712cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10097d990>, '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.KfY59TyE88/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.GnEQWQ1eu7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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 19:46:31 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 19:46:31 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 19:46:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.KfY59TyE88/Render', 19:46:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:46:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:46:31 INFO - 'HOME': '/Users/cltbld', 19:46:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:46:31 INFO - 'LOGNAME': 'cltbld', 19:46:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:46:31 INFO - 'MOZ_NO_REMOTE': '1', 19:46:31 INFO - 'NO_EM_RESTART': '1', 19:46:31 INFO - 'PAGER': '/bin/cat', 19:46:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:46:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:46:31 INFO - 'PWD': '/builds/slave/test', 19:46:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:46:31 INFO - 'SHELL': '/bin/bash', 19:46:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GnEQWQ1eu7/Listeners', 19:46:31 INFO - 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/', 19:46:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:46:31 INFO - 'USER': 'cltbld', 19:46:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:46:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:46:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:46:31 INFO - 'XPC_FLAGS': '0x0', 19:46:31 INFO - 'XPC_SERVICE_NAME': '0', 19:46:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:46:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:46:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:46:31 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-MLZ8xG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:46:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:46:31 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-tCCNAa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:46:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:46:31 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-EjpEq2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:46:32 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-AgUSvZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:46:32 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-KgNJz4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:46:32 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-ETW_1O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:46:32 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-ATTXMP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:46:32 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-5xis7c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:46:32 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-vg0gRI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:46:32 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-b6V4Cx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:46:32 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-q80DmB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:46:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:46:33 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-p8lJff-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:46:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:46:33 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-5NgCxL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:46:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:46:33 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-hlHnkF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:46:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:46:33 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-qWMcK4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:46:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:46:33 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-wTqQsN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:46:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:46:33 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-uP5o5t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:46:33 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:46:33 INFO - Running setup.py install for manifestparser 19:46:33 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 19:46:33 INFO - Running setup.py install for mozcrash 19:46:34 INFO - Running setup.py install for mozdebug 19:46:34 INFO - Running setup.py install for mozdevice 19:46:34 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 19:46:34 INFO - Installing dm script to /builds/slave/test/build/venv/bin 19:46:34 INFO - Running setup.py install for mozfile 19:46:34 INFO - Running setup.py install for mozhttpd 19:46:34 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 19:46:34 INFO - Running setup.py install for mozinfo 19:46:34 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 19:46:34 INFO - Running setup.py install for mozInstall 19:46:35 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Running setup.py install for mozleak 19:46:35 INFO - Running setup.py install for mozlog 19:46:35 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Running setup.py install for moznetwork 19:46:35 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Running setup.py install for mozprocess 19:46:35 INFO - Running setup.py install for mozprofile 19:46:35 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 19:46:35 INFO - Running setup.py install for mozrunner 19:46:36 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 19:46:36 INFO - Running setup.py install for mozscreenshot 19:46:36 INFO - Running setup.py install for moztest 19:46:36 INFO - Running setup.py install for mozversion 19:46:36 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 19:46:36 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:46:36 INFO - Cleaning up... 19:46:36 INFO - Return code: 0 19:46:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:46:36 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')]} 19:46:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:46:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:36 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')]} 19:46:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:46:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:36 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 0x1009fea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a6b228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8c1acd8250>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009b39f0>, '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 0x100712cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10097d990>, '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.KfY59TyE88/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.GnEQWQ1eu7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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 19:46:36 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 19:46:36 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 19:46:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.KfY59TyE88/Render', 19:46:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:46:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:46:36 INFO - 'HOME': '/Users/cltbld', 19:46:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:46:36 INFO - 'LOGNAME': 'cltbld', 19:46:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:46:36 INFO - 'MOZ_NO_REMOTE': '1', 19:46:36 INFO - 'NO_EM_RESTART': '1', 19:46:36 INFO - 'PAGER': '/bin/cat', 19:46:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:46:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:46:36 INFO - 'PWD': '/builds/slave/test', 19:46:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:46:36 INFO - 'SHELL': '/bin/bash', 19:46:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GnEQWQ1eu7/Listeners', 19:46:36 INFO - 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/', 19:46:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:46:36 INFO - 'USER': 'cltbld', 19:46:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:46:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:46:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:46:36 INFO - 'XPC_FLAGS': '0x0', 19:46:36 INFO - 'XPC_SERVICE_NAME': '0', 19:46:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:46:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:46:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:46:36 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-bcDaFt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:46:37 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)) 19:46:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:46:37 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-cCdfJz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:46:37 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)) 19:46:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:46:37 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-jUm8eC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:46:37 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)) 19:46:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:46:37 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-6u8Bq_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:46:37 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)) 19:46:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:46:37 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-sIo7nh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:46:37 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)) 19:46:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:46:37 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-sbdtef-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:46:37 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)) 19:46:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:46:37 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-vgWEgT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:46:37 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)) 19:46:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:46:37 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-HHXOYD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:46:37 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)) 19:46:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:46:37 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-nSxscS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:46:38 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)) 19:46:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:46:38 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-F99PvS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:46:38 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)) 19:46:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:46:38 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-znY9Zj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:46:38 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)) 19:46:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:46:38 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-tqR7af-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:46:38 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)) 19:46:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:46:38 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-P3Qea9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:46:38 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)) 19:46:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:46:38 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-GoEdr6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:46:38 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)) 19:46:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:46:38 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-Bh9Yee-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:46:38 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)) 19:46:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:46:38 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-a6GPNn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:46:38 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)) 19:46:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:46:38 INFO - Running setup.py (path:/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/pip-pVgnVI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:46:38 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)) 19:46:38 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)) 19:46:38 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)) 19:46:38 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)) 19:46:38 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)) 19:46:38 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)) 19:46:39 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:46:39 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 19:46:39 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 19:46:39 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 19:46:39 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 19:46:39 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 19:46:39 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 19:46:41 INFO - Downloading blessings-1.5.1.tar.gz 19:46:41 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 19:46:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 19:46:41 INFO - Installing collected packages: blessings 19:46:41 INFO - Running setup.py install for blessings 19:46:41 INFO - Successfully installed blessings 19:46:41 INFO - Cleaning up... 19:46:41 INFO - Return code: 0 19:46:41 INFO - Done creating virtualenv /builds/slave/test/build/venv. 19:46:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:46:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:46:42 INFO - Reading from file tmpfile_stdout 19:46:42 INFO - Current package versions: 19:46:42 INFO - blessings == 1.5.1 19:46:42 INFO - blobuploader == 1.2.4 19:46:42 INFO - docopt == 0.6.1 19:46:42 INFO - manifestparser == 1.1 19:46:42 INFO - mozInstall == 1.12 19:46:42 INFO - mozcrash == 0.16 19:46:42 INFO - mozdebug == 0.1 19:46:42 INFO - mozdevice == 0.47 19:46:42 INFO - mozfile == 1.2 19:46:42 INFO - mozhttpd == 0.7 19:46:42 INFO - mozinfo == 0.9 19:46:42 INFO - mozleak == 0.1 19:46:42 INFO - mozlog == 3.0 19:46:42 INFO - moznetwork == 0.27 19:46:42 INFO - mozprocess == 0.22 19:46:42 INFO - mozprofile == 0.27 19:46:42 INFO - mozrunner == 6.11 19:46:42 INFO - mozscreenshot == 0.1 19:46:42 INFO - mozsystemmonitor == 0.0 19:46:42 INFO - moztest == 0.7 19:46:42 INFO - mozversion == 1.4 19:46:42 INFO - psutil == 3.1.1 19:46:42 INFO - requests == 1.2.3 19:46:42 INFO - wsgiref == 0.1.2 19:46:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:46: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')]} 19:46:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:46:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46: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')]} 19:46:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:46:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:46:42 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 0x1009fea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a6b228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8c1acd8250>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009b39f0>, '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 0x100712cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10097d990>, '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.KfY59TyE88/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.GnEQWQ1eu7/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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 19:46:42 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 19:46:42 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 19:46:42 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.KfY59TyE88/Render', 19:46:42 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:46:42 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:46:42 INFO - 'HOME': '/Users/cltbld', 19:46:42 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:46:42 INFO - 'LOGNAME': 'cltbld', 19:46:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:46:42 INFO - 'MOZ_NO_REMOTE': '1', 19:46:42 INFO - 'NO_EM_RESTART': '1', 19:46:42 INFO - 'PAGER': '/bin/cat', 19:46:42 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:46:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:46:42 INFO - 'PWD': '/builds/slave/test', 19:46:42 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:46:42 INFO - 'SHELL': '/bin/bash', 19:46:42 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GnEQWQ1eu7/Listeners', 19:46:42 INFO - 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/', 19:46:42 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:46:42 INFO - 'USER': 'cltbld', 19:46:42 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:46:42 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:46:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:46:42 INFO - 'XPC_FLAGS': '0x0', 19:46:42 INFO - 'XPC_SERVICE_NAME': '0', 19:46:42 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:46:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 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)) 19:46:42 INFO - Cleaning up... 19:46:42 INFO - Return code: 0 19:46:42 INFO - Running post-action listener: _resource_record_post_action 19:46:42 INFO - Running post-action listener: _start_resource_monitoring 19:46:42 INFO - Starting resource monitoring. 19:46:42 INFO - ##### 19:46:42 INFO - ##### Running install step. 19:46:42 INFO - ##### 19:46:42 INFO - Running pre-action listener: _resource_record_pre_action 19:46:42 INFO - Running main action method: install 19:46:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:46:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:46:42 INFO - Reading from file tmpfile_stdout 19:46:42 INFO - Detecting whether we're running mozinstall >=1.0... 19:46:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 19:46:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 19:46:42 INFO - Reading from file tmpfile_stdout 19:46:42 INFO - Output received: 19:46:42 INFO - Usage: mozinstall [options] installer 19:46:42 INFO - Options: 19:46:42 INFO - -h, --help show this help message and exit 19:46:42 INFO - -d DEST, --destination=DEST 19:46:42 INFO - Directory to install application into. [default: 19:46:42 INFO - "/builds/slave/test"] 19:46:42 INFO - --app=APP Application being installed. [default: firefox] 19:46:42 INFO - mkdir: /builds/slave/test/build/application 19:46:42 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'] 19:46:42 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 19:47:20 INFO - Reading from file tmpfile_stdout 19:47:20 INFO - Output received: 19:47:20 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 19:47:20 INFO - Running post-action listener: _resource_record_post_action 19:47:20 INFO - ##### 19:47:20 INFO - ##### Running run-tests step. 19:47:20 INFO - ##### 19:47:20 INFO - Running pre-action listener: _resource_record_pre_action 19:47:20 INFO - Running main action method: run_tests 19:47:20 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 19:47:20 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 19:47:20 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 19:47:20 INFO - 2015-11-04 19:47:20.225 screenresolution[1921:19431] starting screenresolution argv=screenresolution get 19:47:20 INFO - 2015-11-04 19:47:20.228 screenresolution[1921:19431] Display 0: 1600x1200x32@60 19:47:20 INFO - 2015-11-04 19:47:20.235 screenresolution[1922:19433] starting screenresolution argv=screenresolution list 19:47:20 INFO - Available Modes on Display 0 19:47:20 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 19:47:20 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 19:47:20 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 19:47:20 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 19:47:20 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 19:47:20 INFO - Intel HD Graphics 3000: 19:47:20 INFO - Chipset Model: Intel HD Graphics 3000 19:47:20 INFO - Type: GPU 19:47:20 INFO - Bus: Built-In 19:47:20 INFO - VRAM (Total): 512 MB 19:47:20 INFO - VRAM (Dynamic, Max): 10 19:47:20 INFO - Vendor: Intel (0x8086) 19:47:20 INFO - Device ID: 0x0116 19:47:20 INFO - Revision ID: 0x0009 19:47:20 INFO - Displays: 19:47:20 INFO - Display: 19:47:20 INFO - Resolution: 1600 x 1200 @ 60 Hz 19:47:20 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 19:47:20 INFO - Display Serial Number: 1600x1200 60 19:47:20 INFO - Main Display: Yes 19:47:20 INFO - Mirror: Off 19:47:20 INFO - Online: Yes 19:47:20 INFO - Rotation: Supported 19:47:20 INFO - Return code: 0 19:47:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 19:47:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 19:47:20 INFO - Python 2.7.3 19:47:20 INFO - Return code: 0 19:47:20 INFO - grabbing minidump binary from tooltool 19:47:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:47:20 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 0x1009b39f0>, '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 0x100712cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10097d990>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 19:47:20 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 19:47:20 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 19:47:20 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:47:20 INFO - Return code: 0 19:47:20 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 19:47:20 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 19:47:20 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 19:47:20 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 19:47:20 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 19:47:20 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/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0015', '--webServer', 'localhost'] in /builds/slave/test/build 19:47:20 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/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0015 --webServer localhost 19:47:20 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.KfY59TyE88/Render', 19:47:20 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:47:20 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:47:20 INFO - 'HOME': '/Users/cltbld', 19:47:20 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:47:20 INFO - 'LOGNAME': 'cltbld', 19:47:20 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 19:47:20 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 19:47:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:47:20 INFO - 'MOZ_NO_REMOTE': '1', 19:47:20 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 19:47:20 INFO - 'NO_EM_RESTART': '1', 19:47:20 INFO - 'PAGER': '/bin/cat', 19:47:20 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:47:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:47:20 INFO - 'PWD': '/builds/slave/test', 19:47:20 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 19:47:20 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:47:20 INFO - 'SHELL': '/bin/bash', 19:47:20 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.GnEQWQ1eu7/Listeners', 19:47:20 INFO - 'TMPDIR': '/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/', 19:47:20 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:47:20 INFO - 'USER': 'cltbld', 19:47:20 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:47:20 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:47:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:47:20 INFO - 'XPC_FLAGS': '0x0', 19:47:20 INFO - 'XPC_SERVICE_NAME': '0', 19:47:20 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:47:20 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/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0015', '--webServer', 'localhost'] with output_timeout 3600 19:47:20 INFO - mozversion INFO | application_buildid: 20151104182235 19:47:20 INFO - mozversion INFO | application_changeset: 3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166 19:47:20 INFO - mozversion INFO | application_display_name: Nightly 19:47:20 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:47:20 INFO - mozversion INFO | application_name: Firefox 19:47:20 INFO - mozversion INFO | application_remotingname: firefox 19:47:20 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/mozilla-inbound 19:47:20 INFO - mozversion INFO | application_vendor: Mozilla 19:47:20 INFO - mozversion INFO | application_version: 45.0a1 19:47:20 INFO - mozversion INFO | platform_buildid: 20151104182235 19:47:20 INFO - mozversion INFO | platform_changeset: 3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166 19:47:20 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 19:47:20 INFO - mozversion INFO | platform_version: 45.0a1 19:47:20 INFO - 2015-11-04 19:47:20,862 DEBUG : using testdate: 1446695240 19:47:20 INFO - 2015-11-04 19:47:20,862 DEBUG : actual date: 1446695240 19:47:20 INFO - 2015-11-04 19:47:20,910 INFO : starting webserver on 'localhost:57209' 19:47:20 INFO - 2015-11-04 19:47:20,911 INFO : Starting test suite t-yosemite-r5-0015 19:47:20 INFO - 2015-11-04 19:47:20,912 INFO : Starting test dromaeo_css 19:47:20 INFO - 2015-11-04 19:47:20,912 DEBUG : operating with platform_type : mac_ 19:47:20 INFO - 2015-11-04 19:47:20,913 INFO : Initialising browser for dromaeo_css test... 19:47:20 INFO - 2015-11-04 19:47:20,927 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/tmpFC5CAX/profile http://localhost:57209/getInfo.html 19:47:23 INFO - 2015-11-04 19:47:23,486 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:47:23 INFO - 2015-11-04 19:47:23,486 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:47:23 INFO - 2015-11-04 19:47:23,486 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 19:47:23 INFO - 2015-11-04 19:47:23,486 DEBUG : BROWSER_OUTPUT: __metrics 19:47:23 INFO - 2015-11-04 19:47:23,507 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:47:24 INFO - 2015-11-04 19:47:24,234 INFO : Browser initialized. 19:47:24 INFO - 2015-11-04 19:47:24,234 INFO : Running cycle 1/1 for dromaeo_css test... 19:47:24 INFO - 2015-11-04 19:47:24,234 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/tmpFC5CAX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:47:36 INFO - 2015-11-04 19:47:36,157 DEBUG : BROWSER_OUTPUT: RSS: Main: 221384704 19:47:36 INFO - 2015-11-04 19:47:36,157 DEBUG : BROWSER_OUTPUT: 19:48:27 INFO - 2015-11-04 19:48:27,998 DEBUG : BROWSER_OUTPUT: 1446695307994 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] 19:50:37 INFO - 2015-11-04 19:50:37,772 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/dromaeo/cssquery-dojo.html (next: http://localhost:57209/tests/dromaeo/cssquery-ext.html) 19:50:39 INFO - 2015-11-04 19:50:39,244 DEBUG : BROWSER_OUTPUT: RSS: Main: 364085248 19:50:39 INFO - 2015-11-04 19:50:39,245 DEBUG : BROWSER_OUTPUT: 19:53:42 INFO - 2015-11-04 19:53:42,164 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/dromaeo/cssquery-ext.html (next: http://localhost:57209/tests/dromaeo/cssquery-jquery.html) 19:53:42 INFO - 2015-11-04 19:53:42,744 DEBUG : BROWSER_OUTPUT: RSS: Main: 357953536 19:53:42 INFO - 2015-11-04 19:53:42,744 DEBUG : BROWSER_OUTPUT: 19:56:44 INFO - 2015-11-04 19:56:44,926 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/dromaeo/cssquery-jquery.html (next: http://localhost:57209/tests/dromaeo/cssquery-mootools.html) 19:56:45 INFO - 2015-11-04 19:56:45,499 DEBUG : BROWSER_OUTPUT: RSS: Main: 329007104 19:56:45 INFO - 2015-11-04 19:56:45,499 DEBUG : BROWSER_OUTPUT: 19:59:47 INFO - 2015-11-04 19:59:47,609 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/dromaeo/cssquery-mootools.html (next: http://localhost:57209/tests/dromaeo/cssquery-prototype.html) 19:59:48 INFO - 2015-11-04 19:59:48,197 DEBUG : BROWSER_OUTPUT: RSS: Main: 311160832 19:59:48 INFO - 2015-11-04 19:59:48,197 DEBUG : BROWSER_OUTPUT: 20:02:51 INFO - 2015-11-04 20:02:51,088 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/dromaeo/cssquery-prototype.html (next: http://localhost:57209/tests/dromaeo/cssquery-yui.html) 20:02:51 INFO - 2015-11-04 20:02:51,708 DEBUG : BROWSER_OUTPUT: RSS: Main: 312127488 20:02:51 INFO - 2015-11-04 20:02:51,709 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,683 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/dromaeo/cssquery-yui.html (next: http://localhost:57209/tests/dromaeo/cssquery-dojo.html) 20:05:54 INFO - 2015-11-04 20:05:54,948 DEBUG : BROWSER_OUTPUT: RSS: Main: 357654528 20:05:54 INFO - 2015-11-04 20:05:54,948 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,948 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:05:54 INFO - 2015-11-04 20:05:54,949 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:05:54 INFO - 2015-11-04 20:05:54,949 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:05:54 INFO - 2015-11-04 20:05:54,949 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:05:54 INFO - 2015-11-04 20:05:54,949 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2993.2816124130186;2995.3410249745048;3139.497680371141;3222.548843161958;3274.066890936084;4999.400071991357;5008.098542262396;5024.748762561876;5066.923996140052;5069.44236134025;4997.450280469146;5012.348394708692;5059.772310246039;5102.056119617873;5151.510606492387;4691.437027556698;4701.341812146294;4794.065157294329;4802.855914322576;4868.78090485929;4799.592034677039;4801.61587073035;4852.539008794177;4853.247746599282;4915.361003069614;4519.389882365905;4593.747343896118;4688.5077066907825;4707.270373092176;4791.2813078038225;4767.833125840613;4787.257975013878;4869.196582563873;4871.244957031666;5033.521815427565;4796.616270698336;4837.782299796482;4847.321375007502;4851.02979404117;4865.975670121662;4911.656184067117;4973.502649735034;5054.064997975386;5060.46865079165;5113.846584602468;5407.297051383334;5432.076546987022;5464.426235245322;5490.176473528963;5492.313460817398;5487.5884308677005;5488.53347465466;5497.202905578709;5507.146392309199;5556.499915007628;4920.852374428773;4926.753662316905;5004.899902002013;5030.547250747451;5194.454582268883;5489.368722596872;5537.197106419627;5571.916421253684;5618.887622247532;5682.318121825408;5363.758630861621;5374.1938709193155;5385.5960802939935;5398.514133727984;5508.834734957958;5149.742512874342;5278;5400.189971504227;5415.106507426231;5493.587980901369;5373;5390.21841832932;5402.162664786964;5418.403975562764;5583.469570390806;5367.382750983609;5414.539764120094;5415.404305526389;5430.56555475561;5432.972835135799;4055.3105971984833;4073.857414990461;4180.979095104566;4221.598948099926;4288.24955632763;3744.307303148926;3883.0874744435037;3929.626685464876;3945.171513982096;3978.4827972363987;5117;5124.692518448905;5142.074426603247;5193.818216362485;5194.32473778414;5504.339479262434;5535.865147644723;5564.805231816867;5580.804671836466;5598.636088654224;4919.704817710949;5046.1673823818655;5136.280920671109;5143.6399452037995;5150.974245128826;4786.329913812069;4805.183118869801;4877.146499362598;4894.853154405374;4914.65597408178;5561.749721262553;5564.054110801093;5564.387917329091;5593.356763972032;5637.182608521742;5449.972750136224;5533.5849811265125;5549.472800083986;5581.469760372758;5592.161175823659;5431.185322201702;5504.6421982571;5523.668579885059;5549.361823390201;5578.776848925998;5501.779928802803;5535.6955367455175;5536.086545719912;5558.388577256418;5563.109902415594;5315.441878602691;5614.85962850932;5622.044252477007;5628.915566266427;5637.859053523531;5282.4717528246865;5377.623566350318;5392.002479541297;5409.486098820606;5410.540104091197;5362.919556206738;5397.136458166831;5451.754671039892;5457.154141108134;5472.151816468454;5290.523852853108;5296.417394086724;5299.8410047698635;5305.098133317269;5325.068113080273;5294.073537130909;5306.044911915892;5338.599605029716;5340.279062326536;5383.192521121863;5244.554212891947;5257.842264732064;5263.131583288715;5275.1032324505695;5333.626646134733 20:05:54 INFO - 2015-11-04 20:05:54,949 DEBUG : BROWSER_OUTPUT: |1;ext.html;509.61014823659906;510.4487153873815;515.4278750586849;526.2133110999055;540.8864138530909;29077.709222907764;30053.398932021373;37042.07394815128;38057.42913856294;38737.41893871587;40326.39510407346;40412;40450.39324410136;40543.79728101363;41099.794501027456;7840.098388685288;8840.381173317854;8920.598573064228;9068.455892646429;9094.590743416562;8006.519608823489;10497.737556561071;10709.196810239224;10845.83731244032;10889.945550272238;10417.218708596885;10460.63387781424;10544.10375118116;10647.361158330486;10682;8029.317508011826;8259.339252859816;10410.479476026207;10616.46917654118;10623.893761062367;10228.89771102287;10382.79234415315;10393.79212415755;10415.895841041569;10498.580056797795;37468.81265593655;37971.430428543594;38000.80999595012;38403.8079809602;38483.615163848284;2981.7316441520366;3423.3153369326233;3560.0565850049757;3595.7662751921303;3604.4593311003296;26263.34341641455;26516.867415662797;26562.734372656218;26593.734062659514;27216.31959201016;2201.933941981743;2218.7892150245702;2255.6729274255304;2267.682524446579;2325.267540724666;273448;275224;275481;275989;279332;46217.07565848664;47601.5239847604;54980.72509637506;55889;57380.71309643509;53041;53262.201066984024;54243.72878135584;54324.72837635865;54438.727806360715;13938.233397163254;14058.789118163235;14116.435342586181;14199.929000354932;14278.500252491112;10582.94708526468;10593.470326483644;10640.308379955279;10764.838527422095;10817.405042722727;18386.540336491697;18407.815921840876;18427.81572184288;18519.814801852077;18698.43904682862;7798.610069496616;8084.39367047462;8134.858495021365;8160.877586836202;8202.548859812649;847.2247893177797;886.2156991062956;907.9863802042975;929.0662883801735;1018.4907546226887;26981.460370792473;27204.59193112105;28055.298617534725;29103.56344654832;30432.69567304343;995.5072239241622;1003.0370843989706;1025.0825511167463;1117.1788735279563;1126.887311268883;13155.671108222372;13265.867341326462;14525.709485810436;14529.418823246951;15222.238888055554;316786;323425;325060;325829;328325;54905;55085.724571376886;55186.724066380215;55477.445225548036;55701.1644825328;1203.4404002139047;1328.6678330417396;1329.9268540230187;1360.3130419138074;1363.9659008524866;22393.32820015402;27255.86372068127;27886.3028424291;27983.16050518488;28086.85956570204;45571;46707;46852;46972.76513617547;47294;196069;197402;265635;270568;271541;28264;28449.857750711115;28547.857260713565;28742;29030.709692903645;38484;39298.41052384274;39400.60599394084;39520.60479395284;40050.79974600108;32436.189095272806;33447.49828752522;33752.49371259482;33769.604977658084;35087.82456087703;33645.66354336425;34189.48715769216;34435.31129377449;34578.82710586431;35056.64943350636;34944.12639683927;35439;35904;35993.1001724959;36045.63954360528;29649.407011860072;30787.538186926766;30835.691643083283;30893.536596950613;31049.223769405944;22728.949966590968;22881;23146.76853231446;23263;23311.300660980196 20:05:54 INFO - 2015-11-04 20:05:54,949 DEBUG : BROWSER_OUTPUT: |2;jquery.html;312.17429897920016;313.877587740781;317.0346295530111;318.30343284832304;330.42506039491286;16422.50732478026;16652.250648720805;16898.239579218935;18125.184366703495;18370.90814545929;14179.361928713206;14766;14783.92608036961;16833;17225.91387043063;5460.781568737256;5684.658920464785;5704.401037891024;5766.798162064329;5770.855728606797;5636.0136976029235;5645.661260324394;5946.108083787423;5958.242318516027;5979.491743201833;4179.373094035904;4271.402003719466;6372.553921225516;6613.239477460082;6669.299723529032;6517.674116294166;6549.21409430869;6585.440237579812;6592;6597.373249541286;6271.216097987752;6279.591826531261;6304.684765761694;6305.716242769086;6313.40022697843;22447.102115915342;23344.533109337717;23689.407764805845;23712;23887.522249554913;1977.772556156046;1983.7520309961255;2088.5196404826825;2264.864108153516;2266.682664426965;13882.583522494342;14047.979898695832;14263;14359.641008974755;14557;1278.4822147030375;1382.8617138286193;1700.778898743168;1751.544598404424;1791.552111972007;62052.37947620556;64003.67998160026;64144.03783943244;64390;65419.3458065418;15705.293261803246;16375.918120409322;16546.6690666186;16547.669046619;16588.6682266354;23630.64554031691;23836.64245036326;23850.642240366407;23855.522889542113;23878.641820372708;9043.457392556467;9060.456372617664;9060.95469522648;9070.909290907139;9075.273978081737;7553.660085296175;7554.206808285161;7586.924130758732;7725.690972361155;7754.069511658637;7776.144624091346;7808.2191780822595;7823.608819558999;7844.921550784419;7895.092064412666;2649.483350746586;3063.7089476499696;3129.483635200212;3186.824724640167;3202.3595280943437;405.2502869691048;411.4198979438977;415.0433251355654;419.23698868059836;430.06890082970017;10607.257491975643;10808.78382432347;10841.241113122163;10860.782784344268;10940.835887461695;427.3952357414224;429.4674603491648;431.743112847855;443.7892001299357;453.01695321153176;5880.382559831241;5886.852828679317;5916.911246331309;6002.579819412599;6086.573939824169;449111;518613;521250;527482;544295;61545;65055.67472162609;66945.6652716743;67378.66310668415;69323;443.39255220347684;456.3086923311186;466.1958122239178;466.5194849305221;468.25547379666494;9749.36629119105;10162.79674406493;10241.231907607109;10323.896761032294;10365.481725913523;32384.83807580947;34272.82863585666;34436.82781586076;34654.30691386108;35631.46552801658;43411.78294108509;43563;44114.55885441104;44435.777821110685;44702.10595788001;7201.459890508338;7401.59291238987;7402.925970740223;7415.443841711785;7422.406207503279;10856.077233434931;10970.506327215135;11216.158788090763;11286;11348.943255284;9576.521173941135;9780.510974451392;9793.069658382443;9867.901320986986;9878.703638890845;9255.53722313895;9347.906520934976;9390.436573805593;9448.244140468609;9511.57197926081;9797.363171393836;9822.5088745561;9955.751106222402;10040.146587539848;10061.899381006097;7197.604131772803;7323.7436689715605;7350.96324518374;7354;7361.1166659999;9178.632854685738;9352.064793520594;9672.419654820733;9690.95154524223;9699.806003879741 20:05:54 INFO - 2015-11-04 20:05:54,950 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1512.8260250071246;1611.6132128289214;1732.8786984911058;1753.0708724376082;1758.7361895715642;6298.527610429219;6906;7082.539634923726;7097.645117744118;7111.608861512615;6582.17722784652;6905.7237710491645;6908.101946746929;6911.861762764742;6920.342567456084;1782.8484578810817;1809.5566586186403;2006.6889632106975;2069.9896500517475;2086.2072412483312;2056.7326247587794;2060.9484762880898;2072.160774886166;2095.706601075851;2097.6329142400095;1981.1481063142842;1984.6923726822292;2019.989900050505;2048.4366799130207;2057.2902348689677;1923.7114432835047;1926.3257859749117;1975.4370004548707;1997.4007797660715;2030.289398710447;2047.0481226229726;2053.394248696623;2061.8865962372065;2081.3027635742046;2089.185217765073;6791.966040169817;6828.863422731567;6914.135733033371;6915.204751453597;6921.584704917721;4388.802503887301;4413.0732546165345;4459.509453960061;4468.955310446887;4470.284754439306;2373.655819906104;2534.822562420631;2709.6883858356146;2709.986450067757;2713.552263876458;729.4622806801044;750.654698838535;786.2334224131483;804.8511025460308;835.8202986357962;8559.443636163629;8571.528565928871;8675.349348798802;8685.435446696009;8738.60676269563;3888.51393575803;3909.198614284065;3979.2041591681777;3998.420229066769;4023.7988100594853;8249.917500825035;8273.296769774517;8387.580620968927;8389.203025712548;8412.284955778705;4419.447569053868;4491.124230774967;4491.281394976788;4500.392447019676;4504.896300406422;4046.635802777764;4086.7547947123267;4089.5705950875326;4091.529474110456;4091.754494730326;3028.0764366867875;3058.5870907427657;3221.935561288761;3235.53084802707;3284.3267130238246;1098.3025778630467;1102.063246240705;1104.3981030338484;1107.7175320293275;1126.6000569797604;961.9610820314184;1030.9793804123876;1140.5437824870119;1259.7417529406632;1277.5975567696332;6491.350864913566;6515.087887695727;6525.673716314165;6528.640924749089;6554.279029306773;618.4959258204549;622.9096780966825;626.1984659635674;626.9435750782452;756.9062704392101;5267.525922666979;5384.623076384693;5503.3395992481155;5509.972450137804;5513.696746678891;8069.7175598853755;8394.8321033579;8407.663693452316;8414.537200453911;8414.915850841535;8107.310878575269;8165.591720413956;8202.220789025152;8243.422960392834;8254.215849494289;6660.067590537328;6699.330066993261;6704.631245281556;6714.697838597275;6720.361565651353;6378.617282963037;6470.061841033118;6490.902636460552;6501.187351581052;6508.8047358579315;7422.257774222535;7511.474196806171;7523.1348394935285;7542.170361260147;7561.357284630648;7545.471816972759;7704.614769261402;7708.306252437307;7731.536107833548;7741.883871742041;6361.300256971637;6403.96798016007;6409.4231519163495;6409.7115629795835;6425.293217745951;6079.817605471843;6291.591046581958;6741.764038258638;6771.729130834711;6860.382565569123;6289.339619339903;6438.806835794933;6447.194100737408;6565.934340656723;6570.8357291068105;6180.536459765445;6307.779227727007;6413.8717225656155;6456.322086180883;6467.935320646733;5826.970865145647;5990.281166260077;5993.520518358434;6010.9699451502465;6013.3685962975005;6047.848803779941;6062.666553339609;6141.447269745744;6142.785002525069;6145.262568491809;5924.4667979882015;6160.075988601746;6163.106349579376;6205.81382558524;6210.099535567408 20:05:54 INFO - 2015-11-04 20:05:54,950 DEBUG : BROWSER_OUTPUT: |4;prototype.html;295.40623347072386;297.476441463025;298.9387175628996;300.33176182992844;303.7145083621397;5857.179994800731;5881.911771323423;5884.323302820177;5902.675352855591;5931.080682494215;5600.747966341514;5630.887382252353;5710.172025056364;5824.912626310598;5866.88266234675;4500.0774841157645;4504.684672072956;4543.273076307792;4573.382593349905;4590.517995610463;4390.67069969752;4487.483939346968;4557.544245575449;4560.315952607119;4592.5407459253975;4380.780960951955;4414.955850441486;4487.057717879233;4489.214387482194;4503.392042074311;4456.242438785414;4484.080763443486;4494.1910456117885;4503.392042074311;4553.68124231304;3854.69162467002;3888.3389823730035;3906.3359228930867;3920;3926.0773718176206;5645.379008309083;5683.062294721366;5713.514351280146;5715.914261286084;5724.570657200685;4970.900581988376;4981.576565991895;5041.596672266247;5042.168042273021;5042.722650254234;6157.415045570664;6157.7229024694;6159.692015399212;6181.443670069715;6202.937970620281;4111.033907031845;4157.584241575849;4170.35359519275;4174.833006679729;4183.079722461053;6270.78052268173;6334.461570766536;6363.522735794788;6396.1045453636525;6466.612003279772;4240.512341080754;4259.829606815754;4266.893327666771;4270.167317373144;4274.807633656431;4313.245182093121;4343.0662407581885;4367.31858234582;4367.323064924942;4384.539623339567;4965.553100220997;5033.496650335011;5035.77339019745;5036.345275114211;5041.9411923495745;5991.281046274475;6152;6182.041783523561;6188.783392581238;6194.752209911643;1558.096304143594;1578.179346739712;1581.3753567341066;1581.6204111013274;1582.5568840724616;991.7966816802682;1007.5314978535016;1008.2639673038723;1010.7372083258406;1024.8872624011353;5860.912086318709;5862.70686465675;5911.852203694942;5922.703864806743;5931.466168044896;6441.194850643669;6441.613503189824;6478.222613286342;6502.414782669583;6531.673416329165;5686.658800471985;5786.508146807569;5834.183214349994;5851.824445266649;5864.091065884794;3543.964560354415;3559.394902866519;3576.6423357664544;3583.749137560346;3623.293457775761;6431.292557818636;6477.740890364427;6481.222253329631;6489.1888513935755;6543.312952140052;6511.869762604816;6562.67186640666;6621.668916554153;6622.8344291393105;6635.767748128792;6504.739810407626;6508.056331831858;6534.640594767238;6542.247641521286;6560.147180866552;6453.354664533509;6515.543911926309;6517.022446633043;6519.445847103049;6573.868522629617;6163.907541386793;6290.528210384331;6305.180326557518;6353.3011368748475;6356.904646430215;6435.774747883802;6443.677816109082;6490.51321150925;6498.707558159799;6498.967505162444;4139.730917490354;4180.8118634660905;4182.916341673211;4188.036751547223;4198.832046718097;6017.969910150421;6349.619022858643;6355.110284560258;6389.808305750835;6397.584157029778;6284.24589049317;6288.654124023223;6290.119383286252;6291.842703932255;6309.49524038085;6216.191895053614;6275.278342990615;6294.15028971083;6294.741051789569;6319;5947.643141411356;6115.1438798569125;6129.785457508966;6160.16837726919;6170.568060235741;6285.277193122849;6305.96847015762;6310.52671049664;6323.936760632335;6354;6178.814635560941;6180.134781130555;6180.845478863064;6182.536309776875;6188.319284878749 20:05:54 INFO - 2015-11-04 20:05:54,953 DEBUG : BROWSER_OUTPUT: |5;yui.html;692.4592781062138;737.0050431916912;737.6901701285462;744.3338212299992;803.8311954489557;13282.402291896864;13648.658783530416;13719.519816806414;13760.44958201672;14839.777403338958;13754;13838.238896860694;13885;13940.930295348535;13947.093438926462;660.3000819131712;670.93290670933;818.2022528035163;831.4429332347312;842.839860426517;811.2941740685612;839.8866153069349;842.3682238321259;846.6063280574532;857.4640849469082;851.2338894994524;855.7304449098514;860.1871231686027;860.4622111180512;860.475110182788;677.4884961853794;684.0628339175312;810.4367464612097;854.0605334132466;874.593314108936;635.237714742311;635.6345101566618;636.6530241018656;643.1735220242014;645.3836586060302;12695.555655552103;12769;12779.23324600527;12814.551490697873;12844.614661560168;8819.29445644347;8885.866711999326;9069.455832649996;9328.953355233249;9418.1994530465;8472.576371181478;8571.357148213847;8632.557585148572;8871.733847984571;9092.999770025292;2853.81450205738;2885.6104425902654;2902.3614804742924;2941.1176647005814;2944.8969286074885;45199.774001130114;45352;45715.08569828618;45752.54247457516;45823.541764582595;6340.746370145235;6416.582922110048;6540.2805691373915;6563.638999855054;6799.524033317621;11121;11179.161562882817;11303;11303.208775385645;11317.83023254652;5757.88484230313;5854.063349864001;5873.911891321633;6051.697415129226;6101.328853826076;3400.6939375456327;3495.3358861816173;3533.611302756695;3551.3074950384425;3597.3165098631175;2536.6195070739536;2566.2173037223824;2568.0498215660327;2573.4467089575833;2577.2268319504074;374.7339389033762;377.4677704436731;378.4323514727908;380.06693567292785;382.7014928355887;445.14532098371205;471.8490083173352;494.3523983581448;519.5609709795217;522.4644739142334;7393.889091663629;7769.883451748228;7916.327112195528;8002.919970800334;8029.868406007524;414.91286829766085;547.5947798629065;568.8265079150816;569.3680015183144;581.3140494216865;3617.6201498842242;3733.2720119576966;3734.477173195755;3859.55615104261;3890.9416358754643;59942.70028649916;60509.39490605125;60641.393586063576;60672.39327606756;60951.695241524394;47972.28041579379;48172.5182748168;48486.27270590944;48579.75710121497;48925.51074489281;44209.77895110568;44670.32994505085;44772.10455790866;45446;45642.315365268885;7801.921980780119;7801.935503201034;8004.51972881629;8268.558297532269;8390.874136887829;33181.83409082939;33186.83406582951;34440.13899652529;36500.08749781277;36922.44616330703;45812.770936145105;45897.77051114723;46364.536354636024;47261.29108063313;48193.27710084282;7275.054242948383;7290.854182916418;7331;7494.775156745306;7585.241475852371;10770.730731731455;10903;10923.399213043358;11286.040686541408;11503.827442588536;9832.852507212541;9883.308168428428;10223.846642300521;10388.324758890649;10478;10106.140978016656;10307.690769276935;10444.63443779464;10483.108935740242;11064.446777661246;6779.0248113809475;9268.119528644767;10137.64518241858;10152.289339746147;10791.406472643766;8791.692290769792;8959.820803584022;8976.461412315282;8991.955040224757;9198.49408282551;8694.615419007856;8835.293176545989;8971.82056358856;9033.909660903308;9239.307051971264 20:05:54 INFO - 2015-11-04 20:05:54,953 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:05:54 INFO - 2015-11-04 20:05:54,954 DEBUG : BROWSER_OUTPUT: __start_cc_report 20:05:54 INFO - 2015-11-04 20:05:54,954 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1245 20:05:54 INFO - 2015-11-04 20:05:54,954 DEBUG : BROWSER_OUTPUT: __end_cc_report 20:05:54 INFO - 2015-11-04 20:05:54,954 DEBUG : BROWSER_OUTPUT: __startTimestamp1446696354939__endTimestamp 20:05:54 INFO - 2015-11-04 20:05:54,954 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,954 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:05:54 INFO - 2015-11-04 20:05:54,955 DEBUG : BROWSER_OUTPUT: Number of tests: 6 20:05:54 INFO - 2015-11-04 20:05:54,955 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,955 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5107.65 Median:5290.52 stddev:534.01 (10.1%) stddev-sans-first:509.24 20:05:54 INFO - 2015-11-04 20:05:54,955 DEBUG : BROWSER_OUTPUT: Values: 2993.3 2995.3 3139.5 3222.5 3274.1 4999.4 5008.1 5024.7 5066.9 5069.4 4997.5 5012.3 5059.8 5102.1 5151.5 4691.4 4701.3 4794.1 4802.9 4868.8 4799.6 4801.6 4852.5 4853.2 4915.4 4519.4 4593.7 4688.5 4707.3 4791.3 4767.8 4787.3 4869.2 4871.2 5033.5 4796.6 4837.8 4847.3 4851.0 4866.0 4911.7 4973.5 5054.1 5060.5 5113.8 5407.3 5432.1 5464.4 5490.2 5492.3 5487.6 5488.5 5497.2 5507.1 5556.5 4920.9 4926.8 5004.9 5030.5 5194.5 5489.4 5537.2 5571.9 5618.9 5682.3 5363.8 5374.2 5385.6 5398.5 5508.8 5149.7 5278.0 5400.2 5415.1 5493.6 5373.0 5390.2 5402.2 5418.4 5583.5 5367.4 5414.5 5415.4 5430.6 5433.0 4055.3 4073.9 4181.0 4221.6 4288.2 3744.3 3883.1 3929.6 3945.2 3978.5 5117.0 5124.7 5142.1 5193.8 5194.3 5504.3 5535.9 5564.8 5580.8 5598.6 4919.7 5046.2 5136.3 5143.6 5151.0 4786.3 4805.2 4877.1 4894.9 4914.7 5561.7 5564.1 5564.4 5593.4 5637.2 5450.0 5533.6 5549.5 5581.5 5592.2 5431.2 5504.6 5523.7 5549.4 5578.8 5501.8 5535.7 5536.1 5558.4 5563.1 5315.4 5614.9 5622.0 5628.9 5637.9 5282.5 5377.6 5392.0 5409.5 5410.5 5362.9 5397.1 5451.8 5457.2 5472.2 5290.5 5296.4 5299.8 5305.1 5325.1 5294.1 5306.0 5338.6 5340.3 5383.2 5244.6 5257.8 5263.1 5275.1 5333.6 20:05:54 INFO - 2015-11-04 20:05:54,955 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,955 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:44251.60 Median:30610.12 stddev:73961.68 (241.6%) stddev-sans-first:74096.24 20:05:54 INFO - 2015-11-04 20:05:54,957 DEBUG : BROWSER_OUTPUT: Values: 509.6 510.4 515.4 526.2 540.9 29077.7 30053.4 37042.1 38057.4 38737.4 40326.4 40412.0 40450.4 40543.8 41099.8 7840.1 8840.4 8920.6 9068.5 9094.6 8006.5 10497.7 10709.2 10845.8 10889.9 10417.2 10460.6 10544.1 10647.4 10682.0 8029.3 8259.3 10410.5 10616.5 10623.9 10228.9 10382.8 10393.8 10415.9 10498.6 37468.8 37971.4 38000.8 38403.8 38483.6 2981.7 3423.3 3560.1 3595.8 3604.5 26263.3 26516.9 26562.7 26593.7 27216.3 2201.9 2218.8 2255.7 2267.7 2325.3 273448.0 275224.0 275481.0 275989.0 279332.0 46217.1 47601.5 54980.7 55889.0 57380.7 53041.0 53262.2 54243.7 54324.7 54438.7 13938.2 14058.8 14116.4 14199.9 14278.5 10582.9 10593.5 10640.3 10764.8 10817.4 18386.5 18407.8 18427.8 18519.8 18698.4 7798.6 8084.4 8134.9 8160.9 8202.5 847.2 886.2 908.0 929.1 1018.5 26981.5 27204.6 28055.3 29103.6 30432.7 995.5 1003.0 1025.1 1117.2 1126.9 13155.7 13265.9 14525.7 14529.4 15222.2 316786.0 323425.0 325060.0 325829.0 328325.0 54905.0 55085.7 55186.7 55477.4 55701.2 1203.4 1328.7 1329.9 1360.3 1364.0 22393.3 27255.9 27886.3 27983.2 28086.9 45571.0 46707.0 46852.0 46972.8 47294.0 196069.0 197402.0 265635.0 270568.0 271541.0 28264.0 28449.9 28547.9 28742.0 29030.7 38484.0 39298.4 39400.6 39520.6 40050.8 32436.2 33447.5 33752.5 33769.6 35087.8 33645.7 34189.5 34435.3 34578.8 35056.6 34944.1 35439.0 35904.0 35993.1 36045.6 29649.4 30787.5 30835.7 30893.5 31049.2 22728.9 22881.0 23146.8 23263.0 23311.3 20:05:54 INFO - 2015-11-04 20:05:54,957 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,957 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:27373.74 Median:461.25 stddev:83794.28 (18166.7%) stddev-sans-first:84004.71 20:05:54 INFO - 2015-11-04 20:05:54,958 DEBUG : BROWSER_OUTPUT: Values: 312.2 313.9 317.0 318.3 330.4 16422.5 16652.3 16898.2 18125.2 18370.9 14179.4 14766.0 14783.9 16833.0 17225.9 5460.8 5684.7 5704.4 5766.8 5770.9 5636.0 5645.7 5946.1 5958.2 5979.5 4179.4 4271.4 6372.6 6613.2 6669.3 6517.7 6549.2 6585.4 6592.0 6597.4 6271.2 6279.6 6304.7 6305.7 6313.4 22447.1 23344.5 23689.4 23712.0 23887.5 1977.8 1983.8 2088.5 2264.9 2266.7 13882.6 14048.0 14263.0 14359.6 14557.0 1278.5 1382.9 1700.8 1751.5 1791.6 62052.4 64003.7 64144.0 64390.0 65419.3 15705.3 16375.9 16546.7 16547.7 16588.7 23630.6 23836.6 23850.6 23855.5 23878.6 9043.5 9060.5 9061.0 9070.9 9075.3 7553.7 7554.2 7586.9 7725.7 7754.1 7776.1 7808.2 7823.6 7844.9 7895.1 2649.5 3063.7 3129.5 3186.8 3202.4 405.3 411.4 415.0 419.2 430.1 10607.3 10808.8 10841.2 10860.8 10940.8 427.4 429.5 431.7 443.8 453.0 5880.4 5886.9 5916.9 6002.6 6086.6 449111.0 518613.0 521250.0 527482.0 544295.0 61545.0 65055.7 66945.7 67378.7 69323.0 443.4 456.3 466.2 466.5 468.3 9749.4 10162.8 10241.2 10323.9 10365.5 32384.8 34272.8 34436.8 34654.3 35631.5 43411.8 43563.0 44114.6 44435.8 44702.1 7201.5 7401.6 7402.9 7415.4 7422.4 10856.1 10970.5 11216.2 11286.0 11348.9 9576.5 9780.5 9793.1 9867.9 9878.7 9255.5 9347.9 9390.4 9448.2 9511.6 9797.4 9822.5 9955.8 10040.1 10061.9 7197.6 7323.7 7351.0 7354.0 7361.1 9178.6 9352.1 9672.4 9691.0 9699.8 20:05:54 INFO - 2015-11-04 20:05:54,959 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,959 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4906.21 Median:6207.96 stddev:2497.51 (40.2%) stddev-sans-first:2491.50 20:05:54 INFO - 2015-11-04 20:05:54,959 DEBUG : BROWSER_OUTPUT: Values: 1512.8 1611.6 1732.9 1753.1 1758.7 6298.5 6906.0 7082.5 7097.6 7111.6 6582.2 6905.7 6908.1 6911.9 6920.3 1782.8 1809.6 2006.7 2070.0 2086.2 2056.7 2060.9 2072.2 2095.7 2097.6 1981.1 1984.7 2020.0 2048.4 2057.3 1923.7 1926.3 1975.4 1997.4 2030.3 2047.0 2053.4 2061.9 2081.3 2089.2 6792.0 6828.9 6914.1 6915.2 6921.6 4388.8 4413.1 4459.5 4469.0 4470.3 2373.7 2534.8 2709.7 2710.0 2713.6 729.5 750.7 786.2 804.9 835.8 8559.4 8571.5 8675.3 8685.4 8738.6 3888.5 3909.2 3979.2 3998.4 4023.8 8249.9 8273.3 8387.6 8389.2 8412.3 4419.4 4491.1 4491.3 4500.4 4504.9 4046.6 4086.8 4089.6 4091.5 4091.8 3028.1 3058.6 3221.9 3235.5 3284.3 1098.3 1102.1 1104.4 1107.7 1126.6 962.0 1031.0 1140.5 1259.7 1277.6 6491.4 6515.1 6525.7 6528.6 6554.3 618.5 622.9 626.2 626.9 756.9 5267.5 5384.6 5503.3 5510.0 5513.7 8069.7 8394.8 8407.7 8414.5 8414.9 8107.3 8165.6 8202.2 8243.4 8254.2 6660.1 6699.3 6704.6 6714.7 6720.4 6378.6 6470.1 6490.9 6501.2 6508.8 7422.3 7511.5 7523.1 7542.2 7561.4 7545.5 7704.6 7708.3 7731.5 7741.9 6361.3 6404.0 6409.4 6409.7 6425.3 6079.8 6291.6 6741.8 6771.7 6860.4 6289.3 6438.8 6447.2 6565.9 6570.8 6180.5 6307.8 6413.9 6456.3 6467.9 5827.0 5990.3 5993.5 6011.0 6013.4 6047.8 6062.7 6141.4 6142.8 6145.3 5924.5 6160.1 6163.1 6205.8 6210.1 20:05:54 INFO - 2015-11-04 20:05:54,959 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,959 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5164.17 Median:5865.49 stddev:1567.83 (26.7%) stddev-sans-first:1529.04 20:05:54 INFO - 2015-11-04 20:05:54,961 DEBUG : BROWSER_OUTPUT: Values: 295.4 297.5 298.9 300.3 303.7 5857.2 5881.9 5884.3 5902.7 5931.1 5600.7 5630.9 5710.2 5824.9 5866.9 4500.1 4504.7 4543.3 4573.4 4590.5 4390.7 4487.5 4557.5 4560.3 4592.5 4380.8 4415.0 4487.1 4489.2 4503.4 4456.2 4484.1 4494.2 4503.4 4553.7 3854.7 3888.3 3906.3 3920.0 3926.1 5645.4 5683.1 5713.5 5715.9 5724.6 4970.9 4981.6 5041.6 5042.2 5042.7 6157.4 6157.7 6159.7 6181.4 6202.9 4111.0 4157.6 4170.4 4174.8 4183.1 6270.8 6334.5 6363.5 6396.1 6466.6 4240.5 4259.8 4266.9 4270.2 4274.8 4313.2 4343.1 4367.3 4367.3 4384.5 4965.6 5033.5 5035.8 5036.3 5041.9 5991.3 6152.0 6182.0 6188.8 6194.8 1558.1 1578.2 1581.4 1581.6 1582.6 991.8 1007.5 1008.3 1010.7 1024.9 5860.9 5862.7 5911.9 5922.7 5931.5 6441.2 6441.6 6478.2 6502.4 6531.7 5686.7 5786.5 5834.2 5851.8 5864.1 3544.0 3559.4 3576.6 3583.7 3623.3 6431.3 6477.7 6481.2 6489.2 6543.3 6511.9 6562.7 6621.7 6622.8 6635.8 6504.7 6508.1 6534.6 6542.2 6560.1 6453.4 6515.5 6517.0 6519.4 6573.9 6163.9 6290.5 6305.2 6353.3 6356.9 6435.8 6443.7 6490.5 6498.7 6499.0 4139.7 4180.8 4182.9 4188.0 4198.8 6018.0 6349.6 6355.1 6389.8 6397.6 6284.2 6288.7 6290.1 6291.8 6309.5 6216.2 6275.3 6294.2 6294.7 6319.0 5947.6 6115.1 6129.8 6160.2 6170.6 6285.3 6306.0 6310.5 6323.9 6354.0 6178.8 6180.1 6180.8 6182.5 6188.3 20:05:54 INFO - 2015-11-04 20:05:54,961 DEBUG : BROWSER_OUTPUT: 20:05:54 INFO - 2015-11-04 20:05:54,961 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12894.98 Median:521.01 stddev:16071.63 (3084.7%) stddev-sans-first:16090.60 20:05:54 INFO - 2015-11-04 20:05:54,963 DEBUG : BROWSER_OUTPUT: Values: 692.5 737.0 737.7 744.3 803.8 13282.4 13648.7 13719.5 13760.4 14839.8 13754.0 13838.2 13885.0 13940.9 13947.1 660.3 670.9 818.2 831.4 842.8 811.3 839.9 842.4 846.6 857.5 851.2 855.7 860.2 860.5 860.5 677.5 684.1 810.4 854.1 874.6 635.2 635.6 636.7 643.2 645.4 12695.6 12769.0 12779.2 12814.6 12844.6 8819.3 8885.9 9069.5 9329.0 9418.2 8472.6 8571.4 8632.6 8871.7 9093.0 2853.8 2885.6 2902.4 2941.1 2944.9 45199.8 45352.0 45715.1 45752.5 45823.5 6340.7 6416.6 6540.3 6563.6 6799.5 11121.0 11179.2 11303.0 11303.2 11317.8 5757.9 5854.1 5873.9 6051.7 6101.3 3400.7 3495.3 3533.6 3551.3 3597.3 2536.6 2566.2 2568.0 2573.4 2577.2 374.7 377.5 378.4 380.1 382.7 445.1 471.8 494.4 519.6 522.5 7393.9 7769.9 7916.3 8002.9 8029.9 414.9 547.6 568.8 569.4 581.3 3617.6 3733.3 3734.5 3859.6 3890.9 59942.7 60509.4 60641.4 60672.4 60951.7 47972.3 48172.5 48486.3 48579.8 48925.5 44209.8 44670.3 44772.1 45446.0 45642.3 7801.9 7801.9 8004.5 8268.6 8390.9 33181.8 33186.8 34440.1 36500.1 36922.4 45812.8 45897.8 46364.5 47261.3 48193.3 7275.1 7290.9 7331.0 7494.8 7585.2 10770.7 10903.0 10923.4 11286.0 11503.8 9832.9 9883.3 10223.8 10388.3 10478.0 10106.1 10307.7 10444.6 10483.1 11064.4 6779.0 9268.1 10137.6 10152.3 10791.4 8791.7 8959.8 8976.5 8992.0 9198.5 8694.6 8835.3 8971.8 9033.9 9239.3 20:05:54 INFO - 2015-11-04 20:05:54,963 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:05:54 INFO - 2015-11-04 20:05:54,963 DEBUG : BROWSER_OUTPUT: 20:05:55 INFO - 2015-11-04 20:05:55,616 INFO : Browser exited with error code: 0 20:05:55 INFO - 2015-11-04 20:05:55,643 INFO : Completed test dromaeo_css (00:18:34) 20:05:55 INFO - 2015-11-04 20:05:55,643 INFO : Starting test kraken 20:05:55 INFO - 2015-11-04 20:05:55,643 DEBUG : operating with platform_type : mac_ 20:05:55 INFO - 2015-11-04 20:05:55,643 INFO : Initialising browser for kraken test... 20:05:55 INFO - 2015-11-04 20:05:55,656 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/tmpAiTgfr/profile http://localhost:57209/getInfo.html 20:05:57 INFO - 2015-11-04 20:05:57,909 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 20:05:57 INFO - 2015-11-04 20:05:57,910 DEBUG : BROWSER_OUTPUT: colorDepth:24 20:05:57 INFO - 2015-11-04 20:05:57,910 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 20:05:57 INFO - 2015-11-04 20:05:57,910 DEBUG : BROWSER_OUTPUT: __metrics 20:05:57 INFO - 2015-11-04 20:05:57,917 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 20:05:58 INFO - 2015-11-04 20:05:58,592 INFO : Browser initialized. 20:05:58 INFO - 2015-11-04 20:05:58,593 INFO : Running cycle 1/1 for kraken test... 20:05:58 INFO - 2015-11-04 20:05:58,593 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/tmpAiTgfr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 20:06:10 INFO - 2015-11-04 20:06:10,480 DEBUG : BROWSER_OUTPUT: RSS: Main: 221302784 20:06:10 INFO - 2015-11-04 20:06:10,480 DEBUG : BROWSER_OUTPUT: 20:06:13 INFO - 2015-11-04 20:06:13,010 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:57209/tests/kraken/driver.html?testName=audio-beat-detection) 20:06:13 INFO - 2015-11-04 20:06:13,593 DEBUG : BROWSER_OUTPUT: RSS: Main: 277786624 20:06:13 INFO - 2015-11-04 20:06:13,593 DEBUG : BROWSER_OUTPUT: 20:06:16 INFO - 2015-11-04 20:06:16,248 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:57209/tests/kraken/driver.html?testName=audio-dft) 20:06:16 INFO - 2015-11-04 20:06:16,824 DEBUG : BROWSER_OUTPUT: RSS: Main: 289742848 20:06:16 INFO - 2015-11-04 20:06:16,824 DEBUG : BROWSER_OUTPUT: 20:06:19 INFO - 2015-11-04 20:06:19,785 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:57209/tests/kraken/driver.html?testName=audio-fft) 20:06:20 INFO - 2015-11-04 20:06:20,368 DEBUG : BROWSER_OUTPUT: RSS: Main: 272048128 20:06:20 INFO - 2015-11-04 20:06:20,368 DEBUG : BROWSER_OUTPUT: 20:06:22 INFO - 2015-11-04 20:06:22,361 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:57209/tests/kraken/driver.html?testName=audio-oscillator) 20:06:22 INFO - 2015-11-04 20:06:22,943 DEBUG : BROWSER_OUTPUT: RSS: Main: 273043456 20:06:22 INFO - 2015-11-04 20:06:22,943 DEBUG : BROWSER_OUTPUT: 20:06:25 INFO - 2015-11-04 20:06:25,114 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:57209/tests/kraken/driver.html?testName=imaging-gaussian-blur) 20:06:25 INFO - 2015-11-04 20:06:25,700 DEBUG : BROWSER_OUTPUT: RSS: Main: 274788352 20:06:25 INFO - 2015-11-04 20:06:25,700 DEBUG : BROWSER_OUTPUT: 20:06:28 INFO - 2015-11-04 20:06:28,728 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:57209/tests/kraken/driver.html?testName=imaging-darkroom) 20:06:29 INFO - 2015-11-04 20:06:29,310 DEBUG : BROWSER_OUTPUT: RSS: Main: 275562496 20:06:29 INFO - 2015-11-04 20:06:29,311 DEBUG : BROWSER_OUTPUT: 20:06:32 INFO - 2015-11-04 20:06:32,438 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:57209/tests/kraken/driver.html?testName=imaging-desaturate) 20:06:33 INFO - 2015-11-04 20:06:33,011 DEBUG : BROWSER_OUTPUT: RSS: Main: 275886080 20:06:33 INFO - 2015-11-04 20:06:33,011 DEBUG : BROWSER_OUTPUT: 20:06:35 INFO - 2015-11-04 20:06:35,883 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:57209/tests/kraken/driver.html?testName=json-parse-financial) 20:06:36 INFO - 2015-11-04 20:06:36,470 DEBUG : BROWSER_OUTPUT: RSS: Main: 274907136 20:06:36 INFO - 2015-11-04 20:06:36,471 DEBUG : BROWSER_OUTPUT: 20:06:38 INFO - 2015-11-04 20:06:38,026 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:57209/tests/kraken/driver.html?testName=json-stringify-tinderbox) 20:06:38 INFO - 2015-11-04 20:06:38,595 DEBUG : BROWSER_OUTPUT: RSS: Main: 309280768 20:06:38 INFO - 2015-11-04 20:06:38,595 DEBUG : BROWSER_OUTPUT: 20:06:40 INFO - 2015-11-04 20:06:40,415 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:57209/tests/kraken/driver.html?testName=stanford-crypto-aes) 20:06:41 INFO - 2015-11-04 20:06:41,030 DEBUG : BROWSER_OUTPUT: RSS: Main: 309694464 20:06:41 INFO - 2015-11-04 20:06:41,030 DEBUG : BROWSER_OUTPUT: 20:06:43 INFO - 2015-11-04 20:06:43,098 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:57209/tests/kraken/driver.html?testName=stanford-crypto-ccm) 20:06:43 INFO - 2015-11-04 20:06:43,683 DEBUG : BROWSER_OUTPUT: RSS: Main: 318693376 20:06:43 INFO - 2015-11-04 20:06:43,683 DEBUG : BROWSER_OUTPUT: 20:06:46 INFO - 2015-11-04 20:06:46,211 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:57209/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 20:06:46 INFO - 2015-11-04 20:06:46,807 DEBUG : BROWSER_OUTPUT: RSS: Main: 320532480 20:06:46 INFO - 2015-11-04 20:06:46,807 DEBUG : BROWSER_OUTPUT: 20:06:49 INFO - 2015-11-04 20:06:49,391 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:57209/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 20:06:49 INFO - 2015-11-04 20:06:49,971 DEBUG : BROWSER_OUTPUT: RSS: Main: 320188416 20:06:49 INFO - 2015-11-04 20:06:49,971 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,706 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:57209/tests/kraken/driver.html?testName=ai-astar) 20:06:51 INFO - 2015-11-04 20:06:51,966 DEBUG : BROWSER_OUTPUT: RSS: Main: 378937344 20:06:51 INFO - 2015-11-04 20:06:51,966 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,966 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:06:51 INFO - 2015-11-04 20:06:51,966 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:06:51 INFO - 2015-11-04 20:06:51,966 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |0;ai-astar;106;109;102;110;109;106;97;107;98;106 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;157;128;150;164;125;150;147;126;166;128 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;160;162;161;162;162;162;162;162;159 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;81;83;86;69;69;72;84;85;67 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;97;97;139;89;89;88;127;88;87;129 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;121;120;120;120;120;115;115;114;114;120 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;125;125;125;125;125;125;125;125;125;125 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;99;101;101;101;100;101;101;101;100;102 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;61;58;58;58;58;58;57;66;57;57 20:06:51 INFO - 2015-11-04 20:06:51,967 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;66;67;67;68;67;68;69;68;68;72 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;86;85;86;85;85;85;85;85;87;87 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;120;124;123;125;130;122;130;124;130;122 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;149;149;149;151;148;147;147;147;151;142 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;68;72;70;70;71;70;69;71;70;69 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: __start_cc_report 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,913 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: __end_cc_report 20:06:51 INFO - 2015-11-04 20:06:51,968 DEBUG : BROWSER_OUTPUT: __startTimestamp1446696411959__endTimestamp 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: Number of tests: 14 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:105.00 Median:109.00 stddev:4.55 (4.2%) stddev-sans-first:4.81 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: Values: 106.0 109.0 102.0 110.0 109.0 106.0 97.0 107.0 98.0 106.0 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:144.10 Median:150.00 stddev:16.09 (10.7%) stddev-sans-first:16.38 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: Values: 157.0 128.0 150.0 164.0 125.0 150.0 147.0 126.0 166.0 128.0 20:06:51 INFO - 2015-11-04 20:06:51,969 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,970 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.30 Median:162.00 stddev:1.06 (0.7%) stddev-sans-first:1.12 20:06:51 INFO - 2015-11-04 20:06:51,970 DEBUG : BROWSER_OUTPUT: Values: 161.0 160.0 162.0 161.0 162.0 162.0 162.0 162.0 162.0 159.0 20:06:51 INFO - 2015-11-04 20:06:51,970 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,970 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:76.90 Median:82.00 stddev:7.56 (9.2%) stddev-sans-first:7.89 20:06:51 INFO - 2015-11-04 20:06:51,970 DEBUG : BROWSER_OUTPUT: Values: 73.0 81.0 83.0 86.0 69.0 69.0 72.0 84.0 85.0 67.0 20:06:51 INFO - 2015-11-04 20:06:51,970 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,970 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:103.00 Median:88.50 stddev:20.33 (23.0%) stddev-sans-first:21.44 20:06:51 INFO - 2015-11-04 20:06:51,971 DEBUG : BROWSER_OUTPUT: Values: 97.0 97.0 139.0 89.0 89.0 88.0 127.0 88.0 87.0 129.0 20:06:51 INFO - 2015-11-04 20:06:51,971 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,971 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:117.90 Median:120.00 stddev:2.96 (2.5%) stddev-sans-first:2.92 20:06:51 INFO - 2015-11-04 20:06:51,971 DEBUG : BROWSER_OUTPUT: Values: 121.0 120.0 120.0 120.0 120.0 115.0 115.0 114.0 114.0 120.0 20:06:51 INFO - 2015-11-04 20:06:51,971 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,971 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:125.00 Median:125.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 20:06:51 INFO - 2015-11-04 20:06:51,971 DEBUG : BROWSER_OUTPUT: Values: 125.0 125.0 125.0 125.0 125.0 125.0 125.0 125.0 125.0 125.0 20:06:51 INFO - 2015-11-04 20:06:51,971 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,972 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:100.70 Median:101.00 stddev:0.82 (0.8%) stddev-sans-first:0.60 20:06:51 INFO - 2015-11-04 20:06:51,972 DEBUG : BROWSER_OUTPUT: Values: 99.0 101.0 101.0 101.0 100.0 101.0 101.0 101.0 100.0 102.0 20:06:51 INFO - 2015-11-04 20:06:51,972 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,972 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:58.80 Median:58.00 stddev:2.78 (4.8%) stddev-sans-first:2.83 20:06:51 INFO - 2015-11-04 20:06:51,972 DEBUG : BROWSER_OUTPUT: Values: 61.0 58.0 58.0 58.0 58.0 58.0 57.0 66.0 57.0 57.0 20:06:51 INFO - 2015-11-04 20:06:51,972 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,972 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.00 Median:68.00 stddev:1.63 (2.4%) stddev-sans-first:1.56 20:06:51 INFO - 2015-11-04 20:06:51,972 DEBUG : BROWSER_OUTPUT: Values: 66.0 67.0 67.0 68.0 67.0 68.0 69.0 68.0 68.0 72.0 20:06:51 INFO - 2015-11-04 20:06:51,973 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,973 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.60 Median:85.50 stddev:0.84 (1.0%) stddev-sans-first:0.88 20:06:51 INFO - 2015-11-04 20:06:51,973 DEBUG : BROWSER_OUTPUT: Values: 86.0 85.0 86.0 85.0 85.0 85.0 85.0 85.0 87.0 87.0 20:06:51 INFO - 2015-11-04 20:06:51,973 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,973 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:125.00 Median:124.50 stddev:3.71 (3.0%) stddev-sans-first:3.47 20:06:51 INFO - 2015-11-04 20:06:51,973 DEBUG : BROWSER_OUTPUT: Values: 120.0 124.0 123.0 125.0 130.0 122.0 130.0 124.0 130.0 122.0 20:06:51 INFO - 2015-11-04 20:06:51,973 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,974 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:148.00 Median:149.00 stddev:2.58 (1.7%) stddev-sans-first:2.71 20:06:51 INFO - 2015-11-04 20:06:51,974 DEBUG : BROWSER_OUTPUT: Values: 149.0 149.0 149.0 151.0 148.0 147.0 147.0 147.0 151.0 142.0 20:06:51 INFO - 2015-11-04 20:06:51,974 DEBUG : BROWSER_OUTPUT: 20:06:51 INFO - 2015-11-04 20:06:51,974 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.00 Median:70.00 stddev:1.15 (1.6%) stddev-sans-first:0.97 20:06:51 INFO - 2015-11-04 20:06:51,974 DEBUG : BROWSER_OUTPUT: Values: 68.0 72.0 70.0 70.0 71.0 70.0 69.0 71.0 70.0 69.0 20:06:51 INFO - 2015-11-04 20:06:51,974 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:06:51 INFO - 2015-11-04 20:06:51,974 DEBUG : BROWSER_OUTPUT: 20:06:52 INFO - 2015-11-04 20:06:52,586 INFO : Browser exited with error code: 0 20:06:52 INFO - 2015-11-04 20:06:52,633 INFO : Completed test kraken (00:00:56) 20:06:52 INFO - 2015-11-04 20:06:52,634 INFO : Starting test v8_7 20:06:52 INFO - 2015-11-04 20:06:52,634 DEBUG : operating with platform_type : mac_ 20:06:52 INFO - 2015-11-04 20:06:52,634 INFO : Initialising browser for v8_7 test... 20:06:52 INFO - 2015-11-04 20:06:52,646 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/tmpozpbGW/profile http://localhost:57209/getInfo.html 20:06:54 INFO - 2015-11-04 20:06:54,780 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 20:06:54 INFO - 2015-11-04 20:06:54,781 DEBUG : BROWSER_OUTPUT: colorDepth:24 20:06:54 INFO - 2015-11-04 20:06:54,781 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 20:06:54 INFO - 2015-11-04 20:06:54,781 DEBUG : BROWSER_OUTPUT: __metrics 20:06:54 INFO - 2015-11-04 20:06:54,801 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 20:06:55 INFO - 2015-11-04 20:06:55,596 INFO : Browser initialized. 20:06:55 INFO - 2015-11-04 20:06:55,596 INFO : Running cycle 1/1 for v8_7 test... 20:06:55 INFO - 2015-11-04 20:06:55,596 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/T/tmpozpbGW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 20:07:07 INFO - 2015-11-04 20:07:07,485 DEBUG : BROWSER_OUTPUT: RSS: Main: 220483584 20:07:07 INFO - 2015-11-04 20:07:07,485 DEBUG : BROWSER_OUTPUT: 20:07:28 INFO - 2015-11-04 20:07:28,937 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:57209/tests/v8_7/run.html (next: http://localhost:57209/tests/v8_7/run.html) 20:07:29 INFO - 2015-11-04 20:07:29,196 DEBUG : BROWSER_OUTPUT: RSS: Main: 598134784 20:07:29 INFO - 2015-11-04 20:07:29,196 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,196 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:07:29 INFO - 2015-11-04 20:07:29,196 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:07:29 INFO - 2015-11-04 20:07:29,196 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |0;Richards;166.38935108153078 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;198.64918553833928 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |2;Encrypt;324.25421530479895 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5752.873563218391 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2061.7283950617284 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |5;Earley;992.063492063492 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |6;Boyer;13712.328767123288 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |7;RegExp;30303.030303030304 20:07:29 INFO - 2015-11-04 20:07:29,197 DEBUG : BROWSER_OUTPUT: |8;Splay;696.8641114982578 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;5813.953488372093 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: __startTimestamp1446696449188__endTimestamp 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: Number of tests: 10 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:166.39 Median:166.39 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,198 DEBUG : BROWSER_OUTPUT: Values: 166.4 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:198.65 Median:198.65 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: Values: 198.6 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:324.25 Median:324.25 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: Values: 324.3 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5752.87 Median:5752.87 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: Values: 5752.9 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,199 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2061.73 Median:2061.73 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: Values: 2061.7 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:992.06 Median:992.06 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: Values: 992.1 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:13712.33 Median:13712.33 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: Values: 13712.3 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:30303.03 Median:30303.03 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: Values: 30303.0 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:696.86 Median:696.86 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: Values: 696.9 20:07:29 INFO - 2015-11-04 20:07:29,200 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,201 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:5813.95 Median:5813.95 stddev:0.00 (0.0%) 20:07:29 INFO - 2015-11-04 20:07:29,201 DEBUG : BROWSER_OUTPUT: Values: 5814.0 20:07:29 INFO - 2015-11-04 20:07:29,201 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:07:29 INFO - 2015-11-04 20:07:29,201 DEBUG : BROWSER_OUTPUT: 20:07:29 INFO - 2015-11-04 20:07:29,858 INFO : Browser exited with error code: 0 20:07:29 INFO - 2015-11-04 20:07:29,878 INFO : Completed test v8_7 (00:00:37) 20:07:30 INFO - 2015-11-04 20:07:30,309 INFO : Completed test suite (00:20:09) 20:07:30 INFO - 2015-11-04 20:07:30,309 DEBUG : Working with test: dromaeo_css 20:07:30 INFO - 2015-11-04 20:07:30,310 DEBUG : Generating results file: dromaeo_css 20:07:30 INFO - 2015-11-04 20:07:30,310 DEBUG : Working with test: kraken 20:07:30 INFO - 2015-11-04 20:07:30,310 DEBUG : Generating results file: kraken 20:07:30 INFO - 2015-11-04 20:07:30,310 INFO : javascript benchmark 20:07:30 INFO - 2015-11-04 20:07:30,311 DEBUG : Working with test: v8_7 20:07:30 INFO - 2015-11-04 20:07:30,311 DEBUG : Generating results file: v8_7 20:07:30 INFO - 2015-11-04 20:07:30,311 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:07:30 INFO - 2015-11-04 20:07:30,361 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,63,55]] 20:07:30 INFO - 2015-11-04 20:07:30,361 DEBUG : process_Request line: dromaeo_css 6496.70 graph.html#tests=[[72,63,55]] 20:07:30 INFO - 2015-11-04 20:07:30,361 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:07:30 INFO - 2015-11-04 20:07:30,395 DEBUG : process_Request line: kraken 1489.30 graph.html#tests=[[232,63,55]] 20:07:30 INFO - 2015-11-04 20:07:30,395 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:07:30 INFO - 2015-11-04 20:07:30,430 DEBUG : process_Request line: v8_7 17657.43 graph.html#tests=[[230,63,55]] 20:07:30 INFO - 2015-11-04 20:07:30,431 INFO : javascript benchmark 20:07:30 INFO - 2015-11-04 20:07:30,432 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [312.17429897920016, 313.877587740781, 317.0346295530111, 318.30343284832304, 330.42506039491286, 16422.50732478026, 16652.250648720805, 16898.239579218935, 18125.184366703495, 18370.90814545929, 14179.361928713206, 14766.0, 14783.92608036961, 16833.0, 17225.91387043063, 5460.781568737256, 5684.658920464785, 5704.401037891024, 5766.798162064329, 5770.855728606797, 5636.0136976029235, 5645.661260324394, 5946.108083787423, 5958.242318516027, 5979.491743201833, 4179.373094035904, 4271.402003719466, 6372.553921225516, 6613.239477460082, 6669.299723529032, 6517.674116294166, 6549.21409430869, 6585.440237579812, 6592.0, 6597.373249541286, 6271.216097987752, 6279.591826531261, 6304.684765761694, 6305.716242769086, 6313.40022697843, 22447.102115915342, 23344.533109337717, 23689.407764805845, 23712.0, 23887.522249554913, 1977.772556156046, 1983.7520309961255, 2088.5196404826825, 2264.864108153516, 2266.682664426965, 13882.583522494342, 14047.979898695832, 14263.0, 14359.641008974755, 14557.0, 1278.4822147030375, 1382.8617138286193, 1700.778898743168, 1751.544598404424, 1791.552111972007, 62052.37947620556, 64003.67998160026, 64144.03783943244, 64390.0, 65419.3458065418, 15705.293261803246, 16375.918120409322, 16546.6690666186, 16547.669046619, 16588.6682266354, 23630.64554031691, 23836.64245036326, 23850.642240366407, 23855.522889542113, 23878.641820372708, 9043.457392556467, 9060.456372617664, 9060.95469522648, 9070.909290907139, 9075.273978081737, 7553.660085296175, 7554.206808285161, 7586.924130758732, 7725.690972361155, 7754.069511658637, 7776.144624091346, 7808.2191780822595, 7823.608819558999, 7844.921550784419, 7895.092064412666, 2649.483350746586, 3063.7089476499696, 3129.483635200212, 3186.824724640167, 3202.3595280943437, 405.2502869691048, 411.4198979438977, 415.0433251355654, 419.23698868059836, 430.06890082970017, 10607.257491975643, 10808.78382432347, 10841.241113122163, 10860.782784344268, 10940.835887461695, 427.3952357414224, 429.4674603491648, 431.743112847855, 443.7892001299357, 453.01695321153176, 5880.382559831241, 5886.852828679317, 5916.911246331309, 6002.579819412599, 6086.573939824169, 449111.0, 518613.0, 521250.0, 527482.0, 544295.0, 61545.0, 65055.67472162609, 66945.6652716743, 67378.66310668415, 69323.0, 443.39255220347684, 456.3086923311186, 466.1958122239178, 466.5194849305221, 468.25547379666494, 9749.36629119105, 10162.79674406493, 10241.231907607109, 10323.896761032294, 10365.481725913523, 32384.83807580947, 34272.82863585666, 34436.82781586076, 34654.30691386108, 35631.46552801658, 43411.78294108509, 43563.0, 44114.55885441104, 44435.777821110685, 44702.10595788001, 7201.459890508338, 7401.59291238987, 7402.925970740223, 7415.443841711785, 7422.406207503279, 10856.077233434931, 10970.506327215135, 11216.158788090763, 11286.0, 11348.943255284, 9576.521173941135, 9780.510974451392, 9793.069658382443, 9867.901320986986, 9878.703638890845, 9255.53722313895, 9347.906520934976, 9390.436573805593, 9448.244140468609, 9511.57197926081, 9797.363171393836, 9822.5088745561, 9955.751106222402, 10040.146587539848, 10061.899381006097, 7197.604131772803, 7323.7436689715605, 7350.96324518374, 7354.0, 7361.1166659999, 9178.632854685738, 9352.064793520594, 9672.419654820733, 9690.95154524223, 9699.806003879741], "dojo.html": [2993.2816124130186, 2995.3410249745048, 3139.497680371141, 3222.548843161958, 3274.066890936084, 4999.400071991357, 5008.098542262396, 5024.748762561876, 5066.923996140052, 5069.44236134025, 4997.450280469146, 5012.348394708692, 5059.772310246039, 5102.056119617873, 5151.510606492387, 4691.437027556698, 4701.341812146294, 4794.065157294329, 4802.855914322576, 4868.78090485929, 4799.592034677039, 4801.61587073035, 4852.539008794177, 4853.247746599282, 4915.361003069614, 4519.389882365905, 4593.747343896118, 4688.5077066907825, 4707.270373092176, 4791.2813078038225, 4767.833125840613, 4787.257975013878, 4869.196582563873, 4871.244957031666, 5033.521815427565, 4796.616270698336, 4837.782299796482, 4847.321375007502, 4851.02979404117, 4865.975670121662, 4911.656184067117, 4973.502649735034, 5054.064997975386, 5060.46865079165, 5113.846584602468, 5407.297051383334, 5432.076546987022, 5464.426235245322, 5490.176473528963, 5492.313460817398, 5487.5884308677005, 5488.53347465466, 5497.202905578709, 5507.146392309199, 5556.499915007628, 4920.852374428773, 4926.753662316905, 5004.899902002013, 5030.547250747451, 5194.454582268883, 5489.368722596872, 5537.197106419627, 5571.916421253684, 5618.887622247532, 5682.318121825408, 5363.758630861621, 5374.1938709193155, 5385.5960802939935, 5398.514133727984, 5508.834734957958, 5149.742512874342, 5278.0, 5400.189971504227, 5415.106507426231, 5493.587980901369, 5373.0, 5390.21841832932, 5402.162664786964, 5418.403975562764, 5583.469570390806, 5367.382750983609, 5414.539764120094, 5415.404305526389, 5430.56555475561, 5432.972835135799, 4055.3105971984833, 4073.857414990461, 4180.979095104566, 4221.598948099926, 4288.24955632763, 3744.307303148926, 3883.0874744435037, 3929.626685464876, 3945.171513982096, 3978.4827972363987, 5117.0, 5124.692518448905, 5142.074426603247, 5193.818216362485, 5194.32473778414, 5504.339479262434, 5535.865147644723, 5564.805231816867, 5580.804671836466, 5598.636088654224, 4919.704817710949, 5046.1673823818655, 5136.280920671109, 5143.6399452037995, 5150.974245128826, 4786.329913812069, 4805.183118869801, 4877.146499362598, 4894.853154405374, 4914.65597408178, 5561.749721262553, 5564.054110801093, 5564.387917329091, 5593.356763972032, 5637.182608521742, 5449.972750136224, 5533.5849811265125, 5549.472800083986, 5581.469760372758, 5592.161175823659, 5431.185322201702, 5504.6421982571, 5523.668579885059, 5549.361823390201, 5578.776848925998, 5501.779928802803, 5535.6955367455175, 5536.086545719912, 5558.388577256418, 5563.109902415594, 5315.441878602691, 5614.85962850932, 5622.044252477007, 5628.915566266427, 5637.859053523531, 5282.4717528246865, 5377.623566350318, 5392.002479541297, 5409.486098820606, 5410.540104091197, 5362.919556206738, 5397.136458166831, 5451.754671039892, 5457.154141108134, 5472.151816468454, 5290.523852853108, 5296.417394086724, 5299.8410047698635, 5305.098133317269, 5325.068113080273, 5294.073537130909, 5306.044911915892, 5338.599605029716, 5340.279062326536, 5383.192521121863, 5244.554212891947, 5257.842264732064, 5263.131583288715, 5275.1032324505695, 5333.626646134733], "mootools.html": [1512.8260250071246, 1611.6132128289214, 1732.8786984911058, 1753.0708724376082, 1758.7361895715642, 6298.527610429219, 6906.0, 7082.539634923726, 7097.645117744118, 7111.608861512615, 6582.17722784652, 6905.7237710491645, 6908.101946746929, 6911.861762764742, 6920.342567456084, 1782.8484578810817, 1809.5566586186403, 2006.6889632106975, 2069.9896500517475, 2086.2072412483312, 2056.7326247587794, 2060.9484762880898, 2072.160774886166, 2095.706601075851, 2097.6329142400095, 1981.1481063142842, 1984.6923726822292, 2019.989900050505, 2048.4366799130207, 2057.2902348689677, 1923.7114432835047, 1926.3257859749117, 1975.4370004548707, 1997.4007797660715, 2030.289398710447, 2047.0481226229726, 2053.394248696623, 2061.8865962372065, 2081.3027635742046, 2089.185217765073, 6791.966040169817, 6828.863422731567, 6914.135733033371, 6915.204751453597, 6921.584704917721, 4388.802503887301, 4413.0732546165345, 4459.509453960061, 4468.955310446887, 4470.284754439306, 2373.655819906104, 2534.822562420631, 2709.6883858356146, 2709.986450067757, 2713.552263876458, 729.4622806801044, 750.654698838535, 786.2334224131483, 804.8511025460308, 835.8202986357962, 8559.443636163629, 8571.528565928871, 8675.349348798802, 8685.435446696009, 8738.60676269563, 3888.51393575803, 3909.198614284065, 3979.2041591681777, 3998.420229066769, 4023.7988100594853, 8249.917500825035, 8273.296769774517, 8387.580620968927, 8389.203025712548, 8412.284955778705, 4419.447569053868, 4491.124230774967, 4491.281394976788, 4500.392447019676, 4504.896300406422, 4046.635802777764, 4086.7547947123267, 4089.5705950875326, 4091.529474110456, 4091.754494730326, 3028.0764366867875, 3058.5870907427657, 3221.935561288761, 3235.53084802707, 3284.3267130238246, 1098.3025778630467, 1102.063246240705, 1104.3981030338484, 1107.7175320293275, 1126.6000569797604, 961.9610820314184, 1030.9793804123876, 1140.5437824870119, 1259.7417529406632, 1277.5975567696332, 6491.350864913566, 6515.087887695727, 6525.673716314165, 6528.640924749089, 6554.279029306773, 618.4959258204549, 622.9096780966825, 626.1984659635674, 626.9435750782452, 756.9062704392101, 5267.525922666979, 5384.623076384693, 5503.3395992481155, 5509.972450137804, 5513.696746678891, 8069.7175598853755, 8394.8321033579, 8407.663693452316, 8414.537200453911, 8414.915850841535, 8107.310878575269, 8165.591720413956, 8202.220789025152, 8243.422960392834, 8254.215849494289, 6660.067590537328, 6699.330066993261, 6704.631245281556, 6714.697838597275, 6720.361565651353, 6378.617282963037, 6470.061841033118, 6490.902636460552, 6501.187351581052, 6508.8047358579315, 7422.257774222535, 7511.474196806171, 7523.1348394935285, 7542.170361260147, 7561.357284630648, 7545.471816972759, 7704.614769261402, 7708.306252437307, 7731.536107833548, 7741.883871742041, 6361.300256971637, 6403.96798016007, 6409.4231519163495, 6409.7115629795835, 6425.293217745951, 6079.817605471843, 6291.591046581958, 6741.764038258638, 6771.729130834711, 6860.382565569123, 6289.339619339903, 6438.806835794933, 6447.194100737408, 6565.934340656723, 6570.8357291068105, 6180.536459765445, 6307.779227727007, 6413.8717225656155, 6456.322086180883, 6467.935320646733, 5826.970865145647, 5990.281166260077, 5993.520518358434, 6010.9699451502465, 6013.3685962975005, 6047.848803779941, 6062.666553339609, 6141.447269745744, 6142.785002525069, 6145.262568491809, 5924.4667979882015, 6160.075988601746, 6163.106349579376, 6205.81382558524, 6210.099535567408], "ext.html": [509.61014823659906, 510.4487153873815, 515.4278750586849, 526.2133110999055, 540.8864138530909, 29077.709222907764, 30053.398932021373, 37042.07394815128, 38057.42913856294, 38737.41893871587, 40326.39510407346, 40412.0, 40450.39324410136, 40543.79728101363, 41099.794501027456, 7840.098388685288, 8840.381173317854, 8920.598573064228, 9068.455892646429, 9094.590743416562, 8006.519608823489, 10497.737556561071, 10709.196810239224, 10845.83731244032, 10889.945550272238, 10417.218708596885, 10460.63387781424, 10544.10375118116, 10647.361158330486, 10682.0, 8029.317508011826, 8259.339252859816, 10410.479476026207, 10616.46917654118, 10623.893761062367, 10228.89771102287, 10382.79234415315, 10393.79212415755, 10415.895841041569, 10498.580056797795, 37468.81265593655, 37971.430428543594, 38000.80999595012, 38403.8079809602, 38483.615163848284, 2981.7316441520366, 3423.3153369326233, 3560.0565850049757, 3595.7662751921303, 3604.4593311003296, 26263.34341641455, 26516.867415662797, 26562.734372656218, 26593.734062659514, 27216.31959201016, 2201.933941981743, 2218.7892150245702, 2255.6729274255304, 2267.682524446579, 2325.267540724666, 273448.0, 275224.0, 275481.0, 275989.0, 279332.0, 46217.07565848664, 47601.5239847604, 54980.72509637506, 55889.0, 57380.71309643509, 53041.0, 53262.201066984024, 54243.72878135584, 54324.72837635865, 54438.727806360715, 13938.233397163254, 14058.789118163235, 14116.435342586181, 14199.929000354932, 14278.500252491112, 10582.94708526468, 10593.470326483644, 10640.308379955279, 10764.838527422095, 10817.405042722727, 18386.540336491697, 18407.815921840876, 18427.81572184288, 18519.814801852077, 18698.43904682862, 7798.610069496616, 8084.39367047462, 8134.858495021365, 8160.877586836202, 8202.548859812649, 847.2247893177797, 886.2156991062956, 907.9863802042975, 929.0662883801735, 1018.4907546226887, 26981.460370792473, 27204.59193112105, 28055.298617534725, 29103.56344654832, 30432.69567304343, 995.5072239241622, 1003.0370843989706, 1025.0825511167463, 1117.1788735279563, 1126.887311268883, 13155.671108222372, 13265.867341326462, 14525.709485810436, 14529.418823246951, 15222.238888055554, 316786.0, 323425.0, 325060.0, 325829.0, 328325.0, 54905.0, 55085.724571376886, 55186.724066380215, 55477.445225548036, 55701.1644825328, 1203.4404002139047, 1328.6678330417396, 1329.9268540230187, 1360.3130419138074, 1363.9659008524866, 22393.32820015402, 27255.86372068127, 27886.3028424291, 27983.16050518488, 28086.85956570204, 45571.0, 46707.0, 46852.0, 46972.76513617547, 47294.0, 196069.0, 197402.0, 265635.0, 270568.0, 271541.0, 28264.0, 28449.857750711115, 28547.857260713565, 28742.0, 29030.709692903645, 38484.0, 39298.41052384274, 39400.60599394084, 39520.60479395284, 40050.79974600108, 32436.189095272806, 33447.49828752522, 33752.49371259482, 33769.604977658084, 35087.82456087703, 33645.66354336425, 34189.48715769216, 34435.31129377449, 34578.82710586431, 35056.64943350636, 34944.12639683927, 35439.0, 35904.0, 35993.1001724959, 36045.63954360528, 29649.407011860072, 30787.538186926766, 30835.691643083283, 30893.536596950613, 31049.223769405944, 22728.949966590968, 22881.0, 23146.76853231446, 23263.0, 23311.300660980196], "prototype.html": [295.40623347072386, 297.476441463025, 298.9387175628996, 300.33176182992844, 303.7145083621397, 5857.179994800731, 5881.911771323423, 5884.323302820177, 5902.675352855591, 5931.080682494215, 5600.747966341514, 5630.887382252353, 5710.172025056364, 5824.912626310598, 5866.88266234675, 4500.0774841157645, 4504.684672072956, 4543.273076307792, 4573.382593349905, 4590.517995610463, 4390.67069969752, 4487.483939346968, 4557.544245575449, 4560.315952607119, 4592.5407459253975, 4380.780960951955, 4414.955850441486, 4487.057717879233, 4489.214387482194, 4503.392042074311, 4456.242438785414, 4484.080763443486, 4494.1910456117885, 4503.392042074311, 4553.68124231304, 3854.69162467002, 3888.3389823730035, 3906.3359228930867, 3920.0, 3926.0773718176206, 5645.379008309083, 5683.062294721366, 5713.514351280146, 5715.914261286084, 5724.570657200685, 4970.900581988376, 4981.576565991895, 5041.596672266247, 5042.168042273021, 5042.722650254234, 6157.415045570664, 6157.7229024694, 6159.692015399212, 6181.443670069715, 6202.937970620281, 4111.033907031845, 4157.584241575849, 4170.35359519275, 4174.833006679729, 4183.079722461053, 6270.78052268173, 6334.461570766536, 6363.522735794788, 6396.1045453636525, 6466.612003279772, 4240.512341080754, 4259.829606815754, 4266.893327666771, 4270.167317373144, 4274.807633656431, 4313.245182093121, 4343.0662407581885, 4367.31858234582, 4367.323064924942, 4384.539623339567, 4965.553100220997, 5033.496650335011, 5035.77339019745, 5036.345275114211, 5041.9411923495745, 5991.281046274475, 6152.0, 6182.041783523561, 6188.783392581238, 6194.752209911643, 1558.096304143594, 1578.179346739712, 1581.3753567341066, 1581.6204111013274, 1582.5568840724616, 991.7966816802682, 1007.5314978535016, 1008.2639673038723, 1010.7372083258406, 1024.8872624011353, 5860.912086318709, 5862.70686465675, 5911.852203694942, 5922.703864806743, 5931.466168044896, 6441.194850643669, 6441.613503189824, 6478.222613286342, 6502.414782669583, 6531.673416329165, 5686.658800471985, 5786.508146807569, 5834.183214349994, 5851.824445266649, 5864.091065884794, 3543.964560354415, 3559.394902866519, 3576.6423357664544, 3583.749137560346, 3623.293457775761, 6431.292557818636, 6477.740890364427, 6481.222253329631, 6489.1888513935755, 6543.312952140052, 6511.869762604816, 6562.67186640666, 6621.668916554153, 6622.8344291393105, 6635.767748128792, 6504.739810407626, 6508.056331831858, 6534.640594767238, 6542.247641521286, 6560.147180866552, 6453.354664533509, 6515.543911926309, 6517.022446633043, 6519.445847103049, 6573.868522629617, 6163.907541386793, 6290.528210384331, 6305.180326557518, 6353.3011368748475, 6356.904646430215, 6435.774747883802, 6443.677816109082, 6490.51321150925, 6498.707558159799, 6498.967505162444, 4139.730917490354, 4180.8118634660905, 4182.916341673211, 4188.036751547223, 4198.832046718097, 6017.969910150421, 6349.619022858643, 6355.110284560258, 6389.808305750835, 6397.584157029778, 6284.24589049317, 6288.654124023223, 6290.119383286252, 6291.842703932255, 6309.49524038085, 6216.191895053614, 6275.278342990615, 6294.15028971083, 6294.741051789569, 6319.0, 5947.643141411356, 6115.1438798569125, 6129.785457508966, 6160.16837726919, 6170.568060235741, 6285.277193122849, 6305.96847015762, 6310.52671049664, 6323.936760632335, 6354.0, 6178.814635560941, 6180.134781130555, 6180.845478863064, 6182.536309776875, 6188.319284878749], "yui.html": [692.4592781062138, 737.0050431916912, 737.6901701285462, 744.3338212299992, 803.8311954489557, 13282.402291896864, 13648.658783530416, 13719.519816806414, 13760.44958201672, 14839.777403338958, 13754.0, 13838.238896860694, 13885.0, 13940.930295348535, 13947.093438926462, 660.3000819131712, 670.93290670933, 818.2022528035163, 831.4429332347312, 842.839860426517, 811.2941740685612, 839.8866153069349, 842.3682238321259, 846.6063280574532, 857.4640849469082, 851.2338894994524, 855.7304449098514, 860.1871231686027, 860.4622111180512, 860.475110182788, 677.4884961853794, 684.0628339175312, 810.4367464612097, 854.0605334132466, 874.593314108936, 635.237714742311, 635.6345101566618, 636.6530241018656, 643.1735220242014, 645.3836586060302, 12695.555655552103, 12769.0, 12779.23324600527, 12814.551490697873, 12844.614661560168, 8819.29445644347, 8885.866711999326, 9069.455832649996, 9328.953355233249, 9418.1994530465, 8472.576371181478, 8571.357148213847, 8632.557585148572, 8871.733847984571, 9092.999770025292, 2853.81450205738, 2885.6104425902654, 2902.3614804742924, 2941.1176647005814, 2944.8969286074885, 45199.774001130114, 45352.0, 45715.08569828618, 45752.54247457516, 45823.541764582595, 6340.746370145235, 6416.582922110048, 6540.2805691373915, 6563.638999855054, 6799.524033317621, 11121.0, 11179.161562882817, 11303.0, 11303.208775385645, 11317.83023254652, 5757.88484230313, 5854.063349864001, 5873.911891321633, 6051.697415129226, 6101.328853826076, 3400.6939375456327, 3495.3358861816173, 3533.611302756695, 3551.3074950384425, 3597.3165098631175, 2536.6195070739536, 2566.2173037223824, 2568.0498215660327, 2573.4467089575833, 2577.2268319504074, 374.7339389033762, 377.4677704436731, 378.4323514727908, 380.06693567292785, 382.7014928355887, 445.14532098371205, 471.8490083173352, 494.3523983581448, 519.5609709795217, 522.4644739142334, 7393.889091663629, 7769.883451748228, 7916.327112195528, 8002.919970800334, 8029.868406007524, 414.91286829766085, 547.5947798629065, 568.8265079150816, 569.3680015183144, 581.3140494216865, 3617.6201498842242, 3733.2720119576966, 3734.477173195755, 3859.55615104261, 3890.9416358754643, 59942.70028649916, 60509.39490605125, 60641.393586063576, 60672.39327606756, 60951.695241524394, 47972.28041579379, 48172.5182748168, 48486.27270590944, 48579.75710121497, 48925.51074489281, 44209.77895110568, 44670.32994505085, 44772.10455790866, 45446.0, 45642.315365268885, 7801.921980780119, 7801.935503201034, 8004.51972881629, 8268.558297532269, 8390.874136887829, 33181.83409082939, 33186.83406582951, 34440.13899652529, 36500.08749781277, 36922.44616330703, 45812.770936145105, 45897.77051114723, 46364.536354636024, 47261.29108063313, 48193.27710084282, 7275.054242948383, 7290.854182916418, 7331.0, 7494.775156745306, 7585.241475852371, 10770.730731731455, 10903.0, 10923.399213043358, 11286.040686541408, 11503.827442588536, 9832.852507212541, 9883.308168428428, 10223.846642300521, 10388.324758890649, 10478.0, 10106.140978016656, 10307.690769276935, 10444.63443779464, 10483.108935740242, 11064.446777661246, 6779.0248113809475, 9268.119528644767, 10137.64518241858, 10152.289339746147, 10791.406472643766, 8791.692290769792, 8959.820803584022, 8976.461412315282, 8991.955040224757, 9198.49408282551, 8694.615419007856, 8835.293176545989, 8971.82056358856, 9033.909660903308, 9239.307051971264]}, "summary": {"suite": 6496.694982550519, "subtests": {"jquery.html": {"filtered": 8070.596816758997, "value": 8070.596816758997}, "dojo.html": {"filtered": 5075.1710161108595, "value": 5075.1710161108595}, "mootools.html": {"filtered": 4010.536370113926, "value": 4010.536370113926}, "ext.html": {"filtered": 17703.80299200768, "value": 17703.80299200768}, "prototype.html": {"filtered": 4642.466099552205, "value": 4642.466099552205}, "yui.html": {"filtered": 5568.498696950154, "value": 5568.498696950154}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0015"}, "testrun": {"date": 1446695240, "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": "20151104182235", "branch": "Mozilla-Inbound", "revision": "3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166"}}, {"talos_counters": {}, "results": {"audio-dft": [161.0, 160.0, 162.0, 161.0, 162.0, 162.0, 162.0, 162.0, 162.0, 159.0], "ai-astar": [106.0, 109.0, 102.0, 110.0, 109.0, 106.0, 97.0, 107.0, 98.0, 106.0], "imaging-gaussian-blur": [121.0, 120.0, 120.0, 120.0, 120.0, 115.0, 115.0, 114.0, 114.0, 120.0], "audio-beat-detection": [157.0, 128.0, 150.0, 164.0, 125.0, 150.0, 147.0, 126.0, 166.0, 128.0], "json-stringify-tinderbox": [66.0, 67.0, 67.0, 68.0, 67.0, 68.0, 69.0, 68.0, 68.0, 72.0], "stanford-crypto-pbkdf2": [149.0, 149.0, 149.0, 151.0, 148.0, 147.0, 147.0, 147.0, 151.0, 142.0], "json-parse-financial": [61.0, 58.0, 58.0, 58.0, 58.0, 58.0, 57.0, 66.0, 57.0, 57.0], "stanford-crypto-sha256-iterative": [68.0, 72.0, 70.0, 70.0, 71.0, 70.0, 69.0, 71.0, 70.0, 69.0], "audio-fft": [73.0, 81.0, 83.0, 86.0, 69.0, 69.0, 72.0, 84.0, 85.0, 67.0], "imaging-darkroom": [125.0, 125.0, 125.0, 125.0, 125.0, 125.0, 125.0, 125.0, 125.0, 125.0], "stanford-crypto-ccm": [120.0, 124.0, 123.0, 125.0, 130.0, 122.0, 130.0, 124.0, 130.0, 122.0], "audio-oscillator": [97.0, 97.0, 139.0, 89.0, 89.0, 88.0, 127.0, 88.0, 87.0, 129.0], "stanford-crypto-aes": [86.0, 85.0, 86.0, 85.0, 85.0, 85.0, 85.0, 85.0, 87.0, 87.0], "imaging-desaturate": [99.0, 101.0, 101.0, 101.0, 100.0, 101.0, 101.0, 101.0, 100.0, 102.0]}, "summary": {"suite": 1489.2999999999997, "subtests": {"audio-fft": {"filtered": 76.9, "value": 76.9}, "stanford-crypto-pbkdf2": {"filtered": 148.0, "value": 148.0}, "audio-beat-detection": {"filtered": 144.1, "value": 144.1}, "stanford-crypto-ccm": {"filtered": 125.0, "value": 125.0}, "imaging-darkroom": {"filtered": 125.0, "value": 125.0}, "json-parse-financial": {"filtered": 58.8, "value": 58.8}, "audio-oscillator": {"filtered": 103.0, "value": 103.0}, "ai-astar": {"filtered": 105.0, "value": 105.0}, "audio-dft": {"filtered": 161.3, "value": 161.3}, "stanford-crypto-sha256-iterative": {"filtered": 70.0, "value": 70.0}, "json-stringify-tinderbox": {"filtered": 68.0, "value": 68.0}, "imaging-gaussian-blur": {"filtered": 117.9, "value": 117.9}, "stanford-crypto-aes": {"filtered": 85.6, "value": 85.6}, "imaging-desaturate": {"filtered": 100.7, "value": 100.7}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0015"}, "testrun": {"date": 1446695240, "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": "20151104182235", "branch": "Mozilla-Inbound", "revision": "3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166"}}, {"talos_counters": {}, "results": {"DeltaBlue": [198.64918553833928], "Encrypt": [324.25421530479895], "NavierStokes": [5813.953488372093], "Decrypt": [5752.873563218391], "Splay": [696.8641114982578], "Richards": [166.38935108153078], "RegExp": [30303.030303030304], "Earley": [992.063492063492], "Boyer": [13712.328767123288], "RayTrace": [2061.7283950617284]}, "summary": {"suite": 17657.43064311075, "subtests": {"DeltaBlue": {"filtered": 332.838012, "value": 332.838012}, "Encrypt": {"filtered": 820.9022040000002, "value": 820.9022040000002}, "NavierStokes": {"filtered": 255.24799999999982, "value": 255.24799999999982}, "Decrypt": {"filtered": 46.269224775224735, "value": 46.269224775224735}, "Splay": {"filtered": 116.93958500000001, "value": 116.93958500000001}, "RegExp": {"filtered": 30.06250500000002, "value": 30.06250500000002}, "Richards": {"filtered": 212.16501999999997, "value": 212.16501999999997}, "Earley": {"filtered": 671.7947039999999, "value": 671.7947039999999}, "Boyer": {"filtered": 48.60319580419578, "value": 48.60319580419578}, "RayTrace": {"filtered": 358.91682035928136, "value": 358.91682035928136}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0015"}, "testrun": {"date": 1446695240, "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": "20151104182235", "branch": "Mozilla-Inbound", "revision": "3111b73e96d8bd2fb34ad7a3c9731a2fd1ee3166"}}] 20:07:30 INFO - RETURN: dromaeo_css: 6496.70 20:07:30 INFO - RETURN: kraken: 1489.30 20:07:30 INFO - RETURN: v8_7: 17657.43 20:07:30 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,63,55]]", "result": "17657.43"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,63,55]]", "result": "1489.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,63,55]]", "result": "6496.70"}}} 20:07:30 INFO - Return code: 0 20:07:30 INFO - # TBPL SUCCESS # 20:07:30 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 20:07:30 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 20:07:30 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 20:07:30 INFO - 2015-11-04 20:07:30.526 screenresolution[1948:21708] starting screenresolution argv=screenresolution get 20:07:30 INFO - 2015-11-04 20:07:30.530 screenresolution[1948:21708] Display 0: 1600x1200x32@60 20:07:30 INFO - 2015-11-04 20:07:30.536 screenresolution[1949:21711] starting screenresolution argv=screenresolution list 20:07:30 INFO - Available Modes on Display 0 20:07:30 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 20:07:30 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 20:07:30 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 20:07:30 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 20:07:30 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 20:07:30 INFO - Intel HD Graphics 3000: 20:07:30 INFO - Chipset Model: Intel HD Graphics 3000 20:07:30 INFO - Type: GPU 20:07:30 INFO - Bus: Built-In 20:07:30 INFO - VRAM (Total): 512 MB 20:07:30 INFO - VRAM (Dynamic, Max): 10 20:07:30 INFO - Vendor: Intel (0x8086) 20:07:30 INFO - Device ID: 0x0116 20:07:30 INFO - Revision ID: 0x0009 20:07:30 INFO - Displays: 20:07:30 INFO - Display: 20:07:30 INFO - Resolution: 1600 x 1200 @ 60 Hz 20:07:30 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 20:07:30 INFO - Display Serial Number: 1600x1200 60 20:07:30 INFO - Main Display: Yes 20:07:30 INFO - Mirror: Off 20:07:30 INFO - Online: Yes 20:07:30 INFO - Rotation: Supported 20:07:30 INFO - Return code: 0 20:07:30 INFO - Running post-action listener: _resource_record_post_action 20:07:30 INFO - Running post-run listener: _resource_record_post_run 20:07:31 INFO - Total resource usage - Wall time: 1248s; CPU: 30.0%; Read bytes: 2363392; Write bytes: 689112576; Read time: 477; Write time: 56596 20:07:31 INFO - install - Wall time: 38s; CPU: 30.0%; Read bytes: 334512640; Write bytes: 336320512; Read time: 32772; Write time: 6535 20:07:31 INFO - run-tests - Wall time: 1211s; CPU: 30.0%; Read bytes: 2355200; Write bytes: 342412800; Read time: 443; Write time: 48894 20:07:31 INFO - Running post-run listener: _upload_blobber_files 20:07:31 INFO - Blob upload gear active. 20:07:31 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 20:07:31 INFO - Copying logs to upload dir... 20:07:31 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1309.688571 ========= master_lag: 12.76 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 2 secs) (at 2015-11-04 20:07:44.669819) ========= ========= Started set props: build_url (results: 0, elapsed: 2 secs) (at 2015-11-04 20:07:44.675214) ========= 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.KfY59TyE88/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.GnEQWQ1eu7/Listeners TMPDIR=/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.009854 build_url: 'https://queue.taskcluster.net/v1/task/xQ32SVkJSXmq9CxyATc3JQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 2.19 ========= ========= Finished set props: build_url (results: 0, elapsed: 2 secs) (at 2015-11-04 20:07:46.873882) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 20:07:46.874240) ========= 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.KfY59TyE88/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.GnEQWQ1eu7/Listeners TMPDIR=/var/folders/xh/9d_zpw4j105621_zjfk7wn4400000w/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.005185 ========= master_lag: 0.03 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-04 20:07:46.914051) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-04 20:07:46.914394) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-04 20:07:46.917711) ========= ========= Total master_lag: 15.15 =========