builder: mozilla-inbound_yosemite_test-dromaeojs slave: t-yosemite-r5-0052 starttime: 1447630945.16 results: success (0) buildid: 20151115145733 builduid: 73b284f3985a4036bdfd4fe6be364d67 revision: 874285de3dc7729fbda40aad190660249bcca527 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.164942) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.165380) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.165697) ========= 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.gGhMzv2K8b/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.85kEBoicDC/Listeners TMPDIR=/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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.006315 basedir: '/builds/slave/test' ========= master_lag: 0.08 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.249544) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.249924) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.412177) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.412482) ========= 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.gGhMzv2K8b/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.85kEBoicDC/Listeners TMPDIR=/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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.005586 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.468584) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.468921) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.469367) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.469753) ========= 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.gGhMzv2K8b/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.85kEBoicDC/Listeners TMPDIR=/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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-15 15:42:25-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.25, 63.245.215.102, ... Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 1.26G=0s 2015-11-15 15:42:25 (1.26 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.363945 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.873183) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.873535) ========= 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.gGhMzv2K8b/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.85kEBoicDC/Listeners TMPDIR=/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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.021191 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.934265) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:25.934612) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 874285de3dc7729fbda40aad190660249bcca527 --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 874285de3dc7729fbda40aad190660249bcca527 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.gGhMzv2K8b/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.85kEBoicDC/Listeners TMPDIR=/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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-15 15:42:26,020 truncating revision to first 12 chars 2015-11-15 15:42:26,020 Setting DEBUG logging. 2015-11-15 15:42:26,020 attempt 1/10 2015-11-15 15:42:26,020 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/874285de3dc7?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-15 15:42:26,284 unpacking tar archive at: mozilla-inbound-874285de3dc7/testing/mozharness/ program finished with exit code 0 elapsedTime=0.530517 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:26.484218) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:26.484573) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:26.501831) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:26.502169) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-15 15:42:26.502658) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 51 secs) (at 2015-11-15 15:42:26.503030) ========= /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.gGhMzv2K8b/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.85kEBoicDC/Listeners TMPDIR=/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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 15:42:26 INFO - MultiFileLogger online at 20151115 15:42:26 in /builds/slave/test 15:42:26 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 15:42:26 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:42:26 INFO - {'append_to_log': False, 15:42:26 INFO - 'base_work_dir': '/builds/slave/test', 15:42:26 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 15:42:26 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:42:26 INFO - 'branch': 'Mozilla-Inbound', 15:42:26 INFO - 'buildbot_json_path': 'buildprops.json', 15:42:26 INFO - 'config_files': ('talos/mac_config.py',), 15:42:26 INFO - 'default_actions': ('clobber', 15:42:26 INFO - 'read-buildbot-config', 15:42:26 INFO - 'download-and-extract', 15:42:26 INFO - 'populate-webroot', 15:42:26 INFO - 'create-virtualenv', 15:42:26 INFO - 'install', 15:42:26 INFO - 'run-tests'), 15:42:26 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:42:26 INFO - 'download_minidump_stackwalk': True, 15:42:26 INFO - 'download_symbols': 'ondemand', 15:42:26 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:42:26 INFO - 'tooltool.py': '/tools/tooltool.py', 15:42:26 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:42:26 INFO - '/tools/misc-python/virtualenv.py')}, 15:42:26 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:42:26 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:42:26 INFO - 'installer_path': 'installer.exe', 15:42:26 INFO - 'log_level': 'info', 15:42:26 INFO - 'log_name': 'talos', 15:42:26 INFO - 'log_to_console': True, 15:42:26 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 15:42:26 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 15:42:26 INFO - 'opt_config_files': (), 15:42:26 INFO - 'pip_index': False, 15:42:26 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:42:26 INFO - 'cmd': ('bash', 15:42:26 INFO - '-c', 15:42:26 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:42:26 INFO - 'enabled': True, 15:42:26 INFO - 'halt_on_failure': False, 15:42:26 INFO - 'name': 'check_screen_resolution'},), 15:42:26 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 15:42:26 INFO - 'cmd': ('bash', 15:42:26 INFO - '-c', 15:42:26 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 15:42:26 INFO - 'enabled': True, 15:42:26 INFO - 'halt_on_failure': False, 15:42:26 INFO - 'name': 'check_screen_resolution'},), 15:42:26 INFO - 'run_cmd_checks_enabled': True, 15:42:26 INFO - 'sps_profile': False, 15:42:26 INFO - 'sps_profile_interval': 0, 15:42:26 INFO - 'suite': 'dromaeojs', 15:42:26 INFO - 'system_bits': '64', 15:42:26 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:42:26 INFO - 'title': 't-yosemite-r5-0052', 15:42:26 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:42:26 INFO - 'use_talos_json': True, 15:42:26 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:42:26 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:42:26 INFO - 'work_dir': 'build'} 15:42:26 INFO - ##### 15:42:26 INFO - ##### Running clobber step. 15:42:26 INFO - ##### 15:42:26 INFO - Running pre-action listener: _resource_record_pre_action 15:42:26 INFO - Running main action method: clobber 15:42:26 INFO - rmtree: /builds/slave/test/build 15:42:26 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:42:28 INFO - Running post-action listener: _resource_record_post_action 15:42:28 INFO - ##### 15:42:28 INFO - ##### Running read-buildbot-config step. 15:42:28 INFO - ##### 15:42:28 INFO - Running pre-action listener: _resource_record_pre_action 15:42:28 INFO - Running main action method: read_buildbot_config 15:42:28 INFO - Using buildbot properties: 15:42:28 INFO - { 15:42:28 INFO - "properties": { 15:42:28 INFO - "buildnumber": 3431, 15:42:28 INFO - "product": "firefox", 15:42:28 INFO - "script_repo_revision": "production", 15:42:28 INFO - "builddir": "mozilla-inbound_yosemite_test-dromaeojs", 15:42:28 INFO - "repository": "", 15:42:28 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 mozilla-inbound talos dromaeojs", 15:42:28 INFO - "buildid": "20151115145733", 15:42:28 INFO - "slavename": "t-yosemite-r5-0052", 15:42:28 INFO - "pgo_build": "False", 15:42:28 INFO - "basedir": "/builds/slave/test", 15:42:28 INFO - "project": "", 15:42:28 INFO - "platform": "yosemite", 15:42:28 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 15:42:28 INFO - "slavebuilddir": "test", 15:42:28 INFO - "scheduler": "tests-mozilla-inbound-macosx64-talos", 15:42:28 INFO - "branch": "mozilla-inbound", 15:42:28 INFO - "repo_path": "integration/mozilla-inbound", 15:42:28 INFO - "stage_platform": "macosx64", 15:42:28 INFO - "builduid": "73b284f3985a4036bdfd4fe6be364d67", 15:42:28 INFO - "revision": "874285de3dc7729fbda40aad190660249bcca527" 15:42:28 INFO - }, 15:42:28 INFO - "sourcestamp": { 15:42:28 INFO - "repository": "", 15:42:28 INFO - "hasPatch": false, 15:42:28 INFO - "project": "", 15:42:28 INFO - "branch": "mozilla-inbound-macosx64-talos", 15:42:28 INFO - "changes": [ 15:42:28 INFO - { 15:42:28 INFO - "category": null, 15:42:28 INFO - "files": [ 15:42:28 INFO - { 15:42:28 INFO - "url": null, 15:42:28 INFO - "name": "https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 15:42:28 INFO - } 15:42:28 INFO - ], 15:42:28 INFO - "repository": "", 15:42:28 INFO - "rev": "874285de3dc7729fbda40aad190660249bcca527", 15:42:28 INFO - "who": "mozilla@christophkerschbaumer.com", 15:42:28 INFO - "when": 1447630914, 15:42:28 INFO - "number": 6664141, 15:42:28 INFO - "comments": "Bug 1223437 - Use channel.asyncOpen2 in toolkit/components/jsdownloads/test/unit (r=sicking)", 15:42:28 INFO - "project": "", 15:42:28 INFO - "at": "Sun 15 Nov 2015 15:41:54", 15:42:28 INFO - "branch": "mozilla-inbound-macosx64-talos", 15:42:28 INFO - "revlink": "", 15:42:28 INFO - "properties": [ 15:42:28 INFO - [ 15:42:28 INFO - "buildid", 15:42:28 INFO - "20151115145733", 15:42:28 INFO - "Change" 15:42:28 INFO - ], 15:42:28 INFO - [ 15:42:28 INFO - "builduid", 15:42:28 INFO - "73b284f3985a4036bdfd4fe6be364d67", 15:42:28 INFO - "Change" 15:42:28 INFO - ], 15:42:28 INFO - [ 15:42:28 INFO - "pgo_build", 15:42:28 INFO - "False", 15:42:28 INFO - "Change" 15:42:28 INFO - ] 15:42:28 INFO - ], 15:42:28 INFO - "revision": "874285de3dc7729fbda40aad190660249bcca527" 15:42:28 INFO - } 15:42:28 INFO - ], 15:42:28 INFO - "revision": "874285de3dc7729fbda40aad190660249bcca527" 15:42:28 INFO - } 15:42:28 INFO - } 15:42:28 INFO - Found installer url https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 15:42:28 INFO - Running post-action listener: _resource_record_post_action 15:42:28 INFO - ##### 15:42:28 INFO - ##### Running download-and-extract step. 15:42:28 INFO - ##### 15:42:28 INFO - Running pre-action listener: _resource_record_pre_action 15:42:28 INFO - Running main action method: download_and_extract 15:42:28 INFO - mkdir: /builds/slave/test/build/tests 15:42:28 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')]} 15:42:28 INFO - https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 15:42:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/test_packages.json 15:42:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/test_packages.json 15:42:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 15:42:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 15:42:29 INFO - Downloaded 1149 bytes. 15:42:29 INFO - Reading from file /builds/slave/test/build/test_packages.json 15:42:29 INFO - Using the following test package requirements: 15:42:29 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:42:29 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:42:29 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 15:42:29 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:42:29 INFO - u'jsshell-mac.zip'], 15:42:29 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:42:29 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 15:42:29 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:42:29 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:42:29 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 15:42:29 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:42:29 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 15:42:29 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:42:29 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 15:42:29 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 15:42:29 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 15:42:29 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 15:42:29 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 15:42:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:29 INFO - https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 15:42:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:42:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:42:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/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 15:42:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/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 15:42:30 INFO - Downloaded 17464031 bytes. 15:42:30 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 15:42:30 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:42:30 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 15:42:35 INFO - Return code: 0 15:42:35 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 15:42:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:35 INFO - https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 15:42:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:42:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:42:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/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 15:42:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/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 15:42:37 INFO - Downloaded 17464031 bytes. 15:42:37 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 15:42:37 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 15:42:37 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 15:42:44 INFO - Return code: 0 15:42:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:44 INFO - https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 15:42:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:42:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:42:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/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 15:42:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/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 15:42:45 INFO - Downloaded 11131693 bytes. 15:42:45 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 15:42:45 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 15:42:45 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 15:42:45 INFO - Return code: 0 15:42: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')]} 15:42:45 INFO - https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 15:42:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:42:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:42:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 15:42:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SZlQ8-YvRNumcKKYD_xomA/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 15:42:49 INFO - Downloaded 108771021 bytes. 15:42:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:42:49 INFO - mkdir: /builds/slave/test/properties 15:42:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:42:49 INFO - Writing to file /builds/slave/test/properties/build_url 15:42:49 INFO - Contents: 15:42:49 INFO - build_url:https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 15:42:49 INFO - Running post-action listener: _resource_record_post_action 15:42:49 INFO - Running post-action listener: set_extra_try_arguments 15:42:49 INFO - ##### 15:42:49 INFO - ##### Running populate-webroot step. 15:42:49 INFO - ##### 15:42:49 INFO - Running pre-action listener: _resource_record_pre_action 15:42:49 INFO - Running main action method: populate_webroot 15:42:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:42:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:42:49 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 15:42:49 INFO - '../fennec_ids.txt'], 15:42:49 INFO - 'tests': ['tcheck2']}, 15:42:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:42:49 INFO - '--tppagecycles', 15:42:49 INFO - '7'], 15:42:49 INFO - 'tests': ['tsvgm']}}, 15:42:49 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 15:42:49 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:42:49 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:42:49 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:42:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:42:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:42:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:42:49 INFO - 'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:42:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:42:49 INFO - 'tests': ['damp', 'tps']}, 15:42:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:42:49 INFO - 'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['damp', 'tps']}, 15:42:49 INFO - 'g3': {'tests': ['dromaeo_dom']}, 15:42:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:42:49 INFO - 'other': {'tests': ['a11yr', 15:42:49 INFO - 'ts_paint', 15:42:49 INFO - 'tpaint', 15:42:49 INFO - 'sessionrestore', 15:42:49 INFO - 'sessionrestore_no_auto_restore']}, 15:42:49 INFO - 'other-e10s': {'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['a11yr', 15:42:49 INFO - 'ts_paint', 15:42:49 INFO - 'tpaint', 15:42:49 INFO - 'sessionrestore', 15:42:49 INFO - 'sessionrestore_no_auto_restore']}, 15:42:49 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['a11yr', 15:42:49 INFO - 'ts_paint', 15:42:49 INFO - 'tpaint', 15:42:49 INFO - 'sessionrestore', 15:42:49 INFO - 'sessionrestore_no_auto_restore']}, 15:42:49 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['a11yr', 15:42:49 INFO - 'ts_paint', 15:42:49 INFO - 'tpaint', 15:42:49 INFO - 'sessionrestore', 15:42:49 INFO - 'sessionrestore_no_auto_restore']}, 15:42:49 INFO - 'other_l64': {'tests': ['a11yr', 15:42:49 INFO - 'ts_paint', 15:42:49 INFO - 'tpaint', 15:42:49 INFO - 'sessionrestore', 15:42:49 INFO - 'sessionrestore_no_auto_restore']}, 15:42:49 INFO - 'other_nol64': {'tests': ['a11yr', 15:42:49 INFO - 'ts_paint', 15:42:49 INFO - 'tpaint', 15:42:49 INFO - 'sessionrestore', 15:42:49 INFO - 'sessionrestore_no_auto_restore']}, 15:42:49 INFO - 'svgr': {'tests': ['tsvgx', 15:42:49 INFO - 'tsvgr_opacity', 15:42:49 INFO - 'tart', 15:42:49 INFO - 'tscrollx', 15:42:49 INFO - 'cart']}, 15:42:49 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['tsvgx', 15:42:49 INFO - 'tsvgr_opacity', 15:42:49 INFO - 'tart', 15:42:49 INFO - 'tscrollx', 15:42:49 INFO - 'cart']}, 15:42:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:42:49 INFO - 'tests': ['tp5o']}, 15:42:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:42:49 INFO - 'talos_options': ['--e10s'], 15:42:49 INFO - 'tests': ['tp5o']}, 15:42:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:42:49 INFO - 'talos_options': ['--xperf_path', 15:42:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:42:49 INFO - 'tests': ['tp5n']}, 15:42:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:42:49 INFO - 'talos_options': ['--e10s', 15:42:49 INFO - '--xperf_path', 15:42:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:42:49 INFO - 'tests': ['tp5n']}}, 15:42:49 INFO - 'talos.zip': {'path': '', 15:42:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:42:49 INFO - Running post-action listener: _resource_record_post_action 15:42:49 INFO - ##### 15:42:49 INFO - ##### Running create-virtualenv step. 15:42:49 INFO - ##### 15:42:49 INFO - Running pre-action listener: _resource_record_pre_action 15:42:49 INFO - Running main action method: create_virtualenv 15:42:49 INFO - Creating virtualenv /builds/slave/test/build/venv 15:42:49 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 15:42:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:42:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:42:49 INFO - Using real prefix '/tools/python27' 15:42:49 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:42:50 INFO - Installing distribute.............................................................................................................................................................................................done. 15:42:53 INFO - Installing pip.................done. 15:42:53 INFO - Return code: 0 15:42:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:42:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:42:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:42:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:42:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:42:53 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 0x10eec3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10eea0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fae32587ae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ede69f0>, '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 0x10eb46db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10edda8c8>, '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.gGhMzv2K8b/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.85kEBoicDC/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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 15:42:53 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 15:42:53 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 15:42:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gGhMzv2K8b/Render', 15:42:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:42:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:42:53 INFO - 'HOME': '/Users/cltbld', 15:42:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:42:53 INFO - 'LOGNAME': 'cltbld', 15:42:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:42:53 INFO - 'MOZ_NO_REMOTE': '1', 15:42:53 INFO - 'NO_EM_RESTART': '1', 15:42:53 INFO - 'PAGER': '/bin/cat', 15:42:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:42:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:42:53 INFO - 'PWD': '/builds/slave/test', 15:42:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:42:53 INFO - 'SHELL': '/bin/bash', 15:42:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.85kEBoicDC/Listeners', 15:42:53 INFO - 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/', 15:42:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:42:53 INFO - 'USER': 'cltbld', 15:42:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:42:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:42:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:42:53 INFO - 'XPC_FLAGS': '0x0', 15:42:53 INFO - 'XPC_SERVICE_NAME': '0', 15:42:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 15:42:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:42:54 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 15:42:54 INFO - Cleaning up... 15:42:54 INFO - Return code: 0 15:42:54 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 15:42:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:42:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:42:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:42:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:42:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10eec3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10eea0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fae32587ae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ede69f0>, '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 0x10eb46db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10edda8c8>, '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.gGhMzv2K8b/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.85kEBoicDC/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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 15:42:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 15:42:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 15:42:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gGhMzv2K8b/Render', 15:42:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:42:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:42:54 INFO - 'HOME': '/Users/cltbld', 15:42:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:42:54 INFO - 'LOGNAME': 'cltbld', 15:42:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:42:54 INFO - 'MOZ_NO_REMOTE': '1', 15:42:54 INFO - 'NO_EM_RESTART': '1', 15:42:54 INFO - 'PAGER': '/bin/cat', 15:42:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:42:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:42:54 INFO - 'PWD': '/builds/slave/test', 15:42:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:42:54 INFO - 'SHELL': '/bin/bash', 15:42:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.85kEBoicDC/Listeners', 15:42:54 INFO - 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/', 15:42:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:42:54 INFO - 'USER': 'cltbld', 15:42:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:42:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:42:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:42:54 INFO - 'XPC_FLAGS': '0x0', 15:42:54 INFO - 'XPC_SERVICE_NAME': '0', 15:42:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 15:42:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:42:54 INFO - Downloading/unpacking psutil>=0.7.1 15:42:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:42:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:42:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:42:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:42:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:42:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:42:57 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 15:42:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 15:42:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:42:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:42:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:42:57 INFO - Installing collected packages: psutil 15:42:57 INFO - Running setup.py install for psutil 15:42:57 INFO - building 'psutil._psutil_osx' extension 15:42:57 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 15:42:57 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 15:42:57 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 15:42:57 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 15:42:58 INFO - building 'psutil._psutil_posix' extension 15:42:58 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 15:42:58 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 15:42:58 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 15:42:58 INFO - ^ 15:42:58 INFO - 1 warning generated. 15:42:58 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 15:42:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:42:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:42:58 INFO - Successfully installed psutil 15:42:58 INFO - Cleaning up... 15:42:58 INFO - Return code: 0 15:42:58 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 15:42:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:42:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:42:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:42:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:42:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:42:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x10eec3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10eea0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fae32587ae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ede69f0>, '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 0x10eb46db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10edda8c8>, '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.gGhMzv2K8b/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.85kEBoicDC/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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 15:42:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 15:42:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 15:42:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gGhMzv2K8b/Render', 15:42:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:42:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:42:58 INFO - 'HOME': '/Users/cltbld', 15:42:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:42:58 INFO - 'LOGNAME': 'cltbld', 15:42:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:42:58 INFO - 'MOZ_NO_REMOTE': '1', 15:42:58 INFO - 'NO_EM_RESTART': '1', 15:42:58 INFO - 'PAGER': '/bin/cat', 15:42:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:42:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:42:58 INFO - 'PWD': '/builds/slave/test', 15:42:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:42:58 INFO - 'SHELL': '/bin/bash', 15:42:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.85kEBoicDC/Listeners', 15:42:58 INFO - 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/', 15:42:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:42:58 INFO - 'USER': 'cltbld', 15:42:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:42:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:42:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:42:58 INFO - 'XPC_FLAGS': '0x0', 15:42:58 INFO - 'XPC_SERVICE_NAME': '0', 15:42:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 15:42:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:42:58 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 15:42:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:42:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:42:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:42:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:42:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:42:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:43:01 INFO - Downloading mozsystemmonitor-0.0.tar.gz 15:43:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 15:43:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:43:01 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 15:43:01 INFO - Installing collected packages: mozsystemmonitor 15:43:01 INFO - Running setup.py install for mozsystemmonitor 15:43:01 INFO - Successfully installed mozsystemmonitor 15:43:01 INFO - Cleaning up... 15:43:01 INFO - Return code: 0 15:43:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:43: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')]} 15:43:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:43:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:43: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')]} 15:43:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:43:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:43:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--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 0x10eec3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10eea0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fae32587ae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ede69f0>, '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 0x10eb46db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10edda8c8>, '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.gGhMzv2K8b/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.85kEBoicDC/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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 15:43:01 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 15:43:01 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 15:43:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gGhMzv2K8b/Render', 15:43:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:43:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:43:01 INFO - 'HOME': '/Users/cltbld', 15:43:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:43:01 INFO - 'LOGNAME': 'cltbld', 15:43:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:43:01 INFO - 'MOZ_NO_REMOTE': '1', 15:43:01 INFO - 'NO_EM_RESTART': '1', 15:43:01 INFO - 'PAGER': '/bin/cat', 15:43:01 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:43:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:43:01 INFO - 'PWD': '/builds/slave/test', 15:43:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:43:01 INFO - 'SHELL': '/bin/bash', 15:43:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.85kEBoicDC/Listeners', 15:43:01 INFO - 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/', 15:43:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:43:01 INFO - 'USER': 'cltbld', 15:43:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:43:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:43:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:43:01 INFO - 'XPC_FLAGS': '0x0', 15:43:01 INFO - 'XPC_SERVICE_NAME': '0', 15:43:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 15:43:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:43:01 INFO - Downloading/unpacking blobuploader==1.2.4 15:43:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:43:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:43:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:43:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:43:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:43:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:43:04 INFO - Downloading blobuploader-1.2.4.tar.gz 15:43:04 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 15:43:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:43:04 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:43:04 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 15:43:04 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 15:43:04 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 15:43:04 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 15:43:04 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 15:43:04 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 15:43:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 15:43:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:43:05 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:43:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:43:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:43:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:43:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:43:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:43:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:43:05 INFO - Downloading docopt-0.6.1.tar.gz 15:43:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 15:43:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:43:05 INFO - Installing collected packages: blobuploader, requests, docopt 15:43:05 INFO - Running setup.py install for blobuploader 15:43:06 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:43:06 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:43:06 INFO - Running setup.py install for requests 15:43:06 INFO - Running setup.py install for docopt 15:43:06 INFO - Successfully installed blobuploader requests docopt 15:43:06 INFO - Cleaning up... 15:43:07 INFO - Return code: 0 15:43:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:43:07 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')]} 15:43:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:43:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:43:07 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')]} 15:43:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:43:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:43:07 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 0x10eec3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10eea0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fae32587ae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ede69f0>, '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 0x10eb46db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10edda8c8>, '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.gGhMzv2K8b/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.85kEBoicDC/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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 15:43:07 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 15:43:07 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 15:43:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gGhMzv2K8b/Render', 15:43:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:43:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:43:07 INFO - 'HOME': '/Users/cltbld', 15:43:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:43:07 INFO - 'LOGNAME': 'cltbld', 15:43:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:43:07 INFO - 'MOZ_NO_REMOTE': '1', 15:43:07 INFO - 'NO_EM_RESTART': '1', 15:43:07 INFO - 'PAGER': '/bin/cat', 15:43:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:43:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:43:07 INFO - 'PWD': '/builds/slave/test', 15:43:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:43:07 INFO - 'SHELL': '/bin/bash', 15:43:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.85kEBoicDC/Listeners', 15:43:07 INFO - 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/', 15:43:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:43:07 INFO - 'USER': 'cltbld', 15:43:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:43:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:43:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:43:07 INFO - 'XPC_FLAGS': '0x0', 15:43:07 INFO - 'XPC_SERVICE_NAME': '0', 15:43:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 15:43:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:43:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:43:07 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-qV5nNd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:43:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:43:07 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-BKKdGI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:43:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:43:07 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-ohPXz9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:43:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:43:07 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-aiJNNs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:43:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:43:07 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-kCZyQl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:43:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:43:08 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-Ot_oL3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:43:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:43:08 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-XM0jAR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:43:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:43:08 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-fn0jXe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:43:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:43:08 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-KNlEwC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:43:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:43:08 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-gFjch5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:43:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:43:08 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-KM7ftL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:43:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:43:08 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-WwLsdH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:43:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:43:08 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-ZMY1HO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:43:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:43:09 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-e4rFpa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:43:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:43:09 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-Aw_EZB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:43:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:43:09 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-7r9z7O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:43:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:43:09 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-To17uB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:43:09 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:43:09 INFO - Running setup.py install for manifestparser 15:43:09 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:43:09 INFO - Running setup.py install for mozcrash 15:43:09 INFO - Running setup.py install for mozdebug 15:43:10 INFO - Running setup.py install for mozdevice 15:43:10 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:43:10 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:43:10 INFO - Running setup.py install for mozfile 15:43:10 INFO - Running setup.py install for mozhttpd 15:43:10 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:43:10 INFO - Running setup.py install for mozinfo 15:43:10 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:43:10 INFO - Running setup.py install for mozInstall 15:43:11 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:43:11 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:43:11 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:43:11 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:43:11 INFO - Running setup.py install for mozleak 15:43:11 INFO - Running setup.py install for mozlog 15:43:11 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:43:11 INFO - Running setup.py install for moznetwork 15:43:11 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:43:11 INFO - Running setup.py install for mozprocess 15:43:11 INFO - Running setup.py install for mozprofile 15:43:12 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:43:12 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:43:12 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:43:12 INFO - Running setup.py install for mozrunner 15:43:12 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:43:12 INFO - Running setup.py install for mozscreenshot 15:43:12 INFO - Running setup.py install for moztest 15:43:12 INFO - Running setup.py install for mozversion 15:43:12 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:43:12 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:43:12 INFO - Cleaning up... 15:43:12 INFO - Return code: 0 15:43:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:43:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:43:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:43:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:43:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:43:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:43:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:43:12 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 0x10eec3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10eea0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fae32587ae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ede69f0>, '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 0x10eb46db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10edda8c8>, '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.gGhMzv2K8b/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.85kEBoicDC/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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 15:43:12 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 15:43:12 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 15:43:12 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gGhMzv2K8b/Render', 15:43:12 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:43:12 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:43:12 INFO - 'HOME': '/Users/cltbld', 15:43:12 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:43:12 INFO - 'LOGNAME': 'cltbld', 15:43:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:43:12 INFO - 'MOZ_NO_REMOTE': '1', 15:43:12 INFO - 'NO_EM_RESTART': '1', 15:43:12 INFO - 'PAGER': '/bin/cat', 15:43:12 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:43:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:43:12 INFO - 'PWD': '/builds/slave/test', 15:43:12 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:43:12 INFO - 'SHELL': '/bin/bash', 15:43:12 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.85kEBoicDC/Listeners', 15:43:12 INFO - 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/', 15:43:12 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:43:12 INFO - 'USER': 'cltbld', 15:43:12 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:43:12 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:43:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:43:12 INFO - 'XPC_FLAGS': '0x0', 15:43:12 INFO - 'XPC_SERVICE_NAME': '0', 15:43:12 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 15:43:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:43:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:43:13 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-vlqtZF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:43:13 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)) 15:43:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:43:13 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-Qjz2jY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:43:13 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)) 15:43:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:43:13 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-QLqIOY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:43:13 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)) 15:43:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:43:13 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-TsVz_O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:43:13 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)) 15:43:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:43:13 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-i2_JOK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:43:13 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)) 15:43:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:43:13 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-lldBkO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:43:14 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)) 15:43:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:43:14 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-3w5YqB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:43:14 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)) 15:43:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:43:14 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-Bu7aWV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:43:14 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)) 15:43:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:43:14 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-1d28Qj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:43:14 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)) 15:43:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:43:14 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-bd_m2b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:43:14 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)) 15:43:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:43:14 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-HTIthN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:43:14 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)) 15:43:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:43:14 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-FOC8SO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:43:14 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)) 15:43:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:43:14 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-8xRIUP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:43:14 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)) 15:43:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:43:14 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-e1b21_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:43:15 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)) 15:43:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:43:15 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-VXktn3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:43:15 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)) 15:43:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:43:15 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-oDIa7W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:43:15 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)) 15:43:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:43:15 INFO - Running setup.py (path:/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/pip-ZRNo9o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:43:15 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)) 15:43:15 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)) 15:43:15 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)) 15:43:15 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)) 15:43:15 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)) 15:43:15 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)) 15:43:15 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:43:15 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 15:43:15 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 15:43:15 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 15:43:15 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 15:43:15 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 15:43:15 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 15:43:18 INFO - Downloading blessings-1.5.1.tar.gz 15:43:18 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 15:43:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:43:18 INFO - Installing collected packages: blessings 15:43:18 INFO - Running setup.py install for blessings 15:43:18 INFO - Successfully installed blessings 15:43:18 INFO - Cleaning up... 15:43:18 INFO - Return code: 0 15:43:18 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:43:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:43:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:43:18 INFO - Reading from file tmpfile_stdout 15:43:18 INFO - Current package versions: 15:43:18 INFO - blessings == 1.5.1 15:43:18 INFO - blobuploader == 1.2.4 15:43:18 INFO - docopt == 0.6.1 15:43:18 INFO - manifestparser == 1.1 15:43:18 INFO - mozInstall == 1.12 15:43:18 INFO - mozcrash == 0.16 15:43:18 INFO - mozdebug == 0.1 15:43:18 INFO - mozdevice == 0.47 15:43:18 INFO - mozfile == 1.2 15:43:18 INFO - mozhttpd == 0.7 15:43:18 INFO - mozinfo == 0.9 15:43:18 INFO - mozleak == 0.1 15:43:18 INFO - mozlog == 3.0 15:43:18 INFO - moznetwork == 0.27 15:43:18 INFO - mozprocess == 0.22 15:43:18 INFO - mozprofile == 0.27 15:43:18 INFO - mozrunner == 6.11 15:43:18 INFO - mozscreenshot == 0.1 15:43:18 INFO - mozsystemmonitor == 0.0 15:43:18 INFO - moztest == 0.7 15:43:18 INFO - mozversion == 1.4 15:43:18 INFO - psutil == 3.1.1 15:43:18 INFO - requests == 1.2.3 15:43:18 INFO - wsgiref == 0.1.2 15:43:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:43:18 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')]} 15:43:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:43:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:43:18 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')]} 15:43:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:43:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:43:18 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 0x10eec3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10eea0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fae32587ae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ede69f0>, '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 0x10eb46db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10edda8c8>, '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.gGhMzv2K8b/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.85kEBoicDC/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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 15:43:18 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 15:43:18 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 15:43:18 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gGhMzv2K8b/Render', 15:43:18 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:43:18 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:43:18 INFO - 'HOME': '/Users/cltbld', 15:43:18 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:43:18 INFO - 'LOGNAME': 'cltbld', 15:43:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:43:18 INFO - 'MOZ_NO_REMOTE': '1', 15:43:18 INFO - 'NO_EM_RESTART': '1', 15:43:18 INFO - 'PAGER': '/bin/cat', 15:43:18 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:43:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:43:18 INFO - 'PWD': '/builds/slave/test', 15:43:18 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:43:18 INFO - 'SHELL': '/bin/bash', 15:43:18 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.85kEBoicDC/Listeners', 15:43:18 INFO - 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/', 15:43:18 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:43:18 INFO - 'USER': 'cltbld', 15:43:18 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:43:18 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:43:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:43:18 INFO - 'XPC_FLAGS': '0x0', 15:43:18 INFO - 'XPC_SERVICE_NAME': '0', 15:43:18 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 15:43:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 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)) 15:43:19 INFO - Cleaning up... 15:43:19 INFO - Return code: 0 15:43:19 INFO - Running post-action listener: _resource_record_post_action 15:43:19 INFO - Running post-action listener: _start_resource_monitoring 15:43:19 INFO - Starting resource monitoring. 15:43:19 INFO - ##### 15:43:19 INFO - ##### Running install step. 15:43:19 INFO - ##### 15:43:19 INFO - Running pre-action listener: _resource_record_pre_action 15:43:19 INFO - Running main action method: install 15:43:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:43:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:43:19 INFO - Reading from file tmpfile_stdout 15:43:19 INFO - Detecting whether we're running mozinstall >=1.0... 15:43:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:43:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:43:19 INFO - Reading from file tmpfile_stdout 15:43:19 INFO - Output received: 15:43:19 INFO - Usage: mozinstall [options] installer 15:43:19 INFO - Options: 15:43:19 INFO - -h, --help show this help message and exit 15:43:19 INFO - -d DEST, --destination=DEST 15:43:19 INFO - Directory to install application into. [default: 15:43:19 INFO - "/builds/slave/test"] 15:43:19 INFO - --app=APP Application being installed. [default: firefox] 15:43:19 INFO - mkdir: /builds/slave/test/build/application 15:43:19 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'] 15:43:19 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 15:43:59 INFO - Reading from file tmpfile_stdout 15:43:59 INFO - Output received: 15:43:59 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 15:43:59 INFO - Running post-action listener: _resource_record_post_action 15:43:59 INFO - ##### 15:43:59 INFO - ##### Running run-tests step. 15:43:59 INFO - ##### 15:43:59 INFO - Running pre-action listener: _resource_record_pre_action 15:43:59 INFO - Running main action method: run_tests 15:43:59 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 15:43:59 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 15:43:59 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 15:44:00 INFO - 2015-11-15 15:44:00.001 screenresolution[2285:18425] starting screenresolution argv=screenresolution get 15:44:00 INFO - 2015-11-15 15:44:00.005 screenresolution[2285:18425] Display 0: 1600x1200x32@60 15:44:00 INFO - 2015-11-15 15:44:00.012 screenresolution[2286:18427] starting screenresolution argv=screenresolution list 15:44:00 INFO - Available Modes on Display 0 15:44:00 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 15:44:00 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 15:44:00 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 15:44:00 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 15:44:00 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 15:44:00 INFO - Intel HD Graphics 3000: 15:44:00 INFO - Chipset Model: Intel HD Graphics 3000 15:44:00 INFO - Type: GPU 15:44:00 INFO - Bus: Built-In 15:44:00 INFO - VRAM (Total): 512 MB 15:44:00 INFO - VRAM (Dynamic, Max): 10 15:44:00 INFO - Vendor: Intel (0x8086) 15:44:00 INFO - Device ID: 0x0116 15:44:00 INFO - Revision ID: 0x0009 15:44:00 INFO - Displays: 15:44:00 INFO - Display: 15:44:00 INFO - Resolution: 1600 x 1200 @ 60 Hz 15:44:00 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 15:44:00 INFO - Display Serial Number: 1600x1200 60 15:44:00 INFO - Main Display: Yes 15:44:00 INFO - Mirror: Off 15:44:00 INFO - Online: Yes 15:44:00 INFO - Rotation: Supported 15:44:00 INFO - Return code: 0 15:44:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:44:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:44:00 INFO - Python 2.7.3 15:44:00 INFO - Return code: 0 15:44:00 INFO - grabbing minidump binary from tooltool 15:44:00 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')]} 15:44:00 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 0x10ede69f0>, '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 0x10eb46db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10edda8c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:44:00 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 15:44:00 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 15:44:00 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:44:00 INFO - Return code: 0 15:44:00 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 15:44:00 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:44:00 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:44:00 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 15:44:00 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:44:00 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/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0052', '--webServer', 'localhost'] in /builds/slave/test/build 15:44:00 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/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0052 --webServer localhost 15:44:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.gGhMzv2K8b/Render', 15:44:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 15:44:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 15:44:00 INFO - 'HOME': '/Users/cltbld', 15:44:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 15:44:00 INFO - 'LOGNAME': 'cltbld', 15:44:00 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:44:00 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 15:44:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:44:00 INFO - 'MOZ_NO_REMOTE': '1', 15:44:00 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:44:00 INFO - 'NO_EM_RESTART': '1', 15:44:00 INFO - 'PAGER': '/bin/cat', 15:44:00 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 15:44:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:44:00 INFO - 'PWD': '/builds/slave/test', 15:44:00 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:44:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 15:44:00 INFO - 'SHELL': '/bin/bash', 15:44:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.85kEBoicDC/Listeners', 15:44:00 INFO - 'TMPDIR': '/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/', 15:44:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 15:44:00 INFO - 'USER': 'cltbld', 15:44:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 15:44:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 15:44:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:44:00 INFO - 'XPC_FLAGS': '0x0', 15:44:00 INFO - 'XPC_SERVICE_NAME': '0', 15:44:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 15:44:00 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/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0052', '--webServer', 'localhost'] with output_timeout 3600 15:44:00 INFO - mozversion INFO | application_buildid: 20151115145733 15:44:00 INFO - mozversion INFO | application_changeset: 874285de3dc7729fbda40aad190660249bcca527 15:44:00 INFO - mozversion INFO | application_display_name: Nightly 15:44:00 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:44:00 INFO - mozversion INFO | application_name: Firefox 15:44:00 INFO - mozversion INFO | application_remotingname: firefox 15:44:00 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/mozilla-inbound 15:44:00 INFO - mozversion INFO | application_vendor: Mozilla 15:44:00 INFO - mozversion INFO | application_version: 45.0a1 15:44:00 INFO - mozversion INFO | platform_buildid: 20151115145733 15:44:00 INFO - mozversion INFO | platform_changeset: 874285de3dc7729fbda40aad190660249bcca527 15:44:00 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 15:44:00 INFO - mozversion INFO | platform_version: 45.0a1 15:44:00 INFO - 2015-11-15 15:44:00,660 DEBUG : using testdate: 1447631040 15:44:00 INFO - 2015-11-15 15:44:00,660 DEBUG : actual date: 1447631040 15:44:00 INFO - 2015-11-15 15:44:00,670 INFO : starting webserver on 'localhost:49561' 15:44:00 INFO - 2015-11-15 15:44:00,671 INFO : Starting test suite t-yosemite-r5-0052 15:44:00 INFO - 2015-11-15 15:44:00,671 INFO : Starting test dromaeo_css 15:44:00 INFO - 2015-11-15 15:44:00,671 DEBUG : operating with platform_type : mac_ 15:44:00 INFO - 2015-11-15 15:44:00,672 INFO : Initialising browser for dromaeo_css test... 15:44:00 INFO - 2015-11-15 15:44:00,687 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/tmpFWhH2y/profile http://localhost:49561/getInfo.html 15:44:03 INFO - 2015-11-15 15:44:03,191 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 15:44:03 INFO - 2015-11-15 15:44:03,192 DEBUG : BROWSER_OUTPUT: colorDepth:24 15:44:03 INFO - 2015-11-15 15:44:03,192 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 15:44:03 INFO - 2015-11-15 15:44:03,192 DEBUG : BROWSER_OUTPUT: __metrics 15:44:03 INFO - 2015-11-15 15:44:03,208 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:44:03 INFO - 2015-11-15 15:44:03,981 INFO : Browser initialized. 15:44:03 INFO - 2015-11-15 15:44:03,982 INFO : Running cycle 1/1 for dromaeo_css test... 15:44:03 INFO - 2015-11-15 15:44:03,982 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/tmpFWhH2y/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 15:44:16 INFO - 2015-11-15 15:44:16,116 DEBUG : BROWSER_OUTPUT: RSS: Main: 228614144 15:44:16 INFO - 2015-11-15 15:44:16,116 DEBUG : BROWSER_OUTPUT: 15:45:06 INFO - 2015-11-15 15:45:06,960 DEBUG : BROWSER_OUTPUT: 1447631106959 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] 15:47:18 INFO - 2015-11-15 15:47:18,304 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49561/tests/dromaeo/cssquery-ext.html) 15:47:19 INFO - 2015-11-15 15:47:19,566 DEBUG : BROWSER_OUTPUT: RSS: Main: 335912960 15:47:19 INFO - 2015-11-15 15:47:19,566 DEBUG : BROWSER_OUTPUT: 15:50:22 INFO - 2015-11-15 15:50:22,379 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/dromaeo/cssquery-ext.html (next: http://localhost:49561/tests/dromaeo/cssquery-jquery.html) 15:50:22 INFO - 2015-11-15 15:50:22,962 DEBUG : BROWSER_OUTPUT: RSS: Main: 356491264 15:50:22 INFO - 2015-11-15 15:50:22,962 DEBUG : BROWSER_OUTPUT: 15:53:25 INFO - 2015-11-15 15:53:25,250 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49561/tests/dromaeo/cssquery-mootools.html) 15:53:25 INFO - 2015-11-15 15:53:25,831 DEBUG : BROWSER_OUTPUT: RSS: Main: 340975616 15:53:25 INFO - 2015-11-15 15:53:25,831 DEBUG : BROWSER_OUTPUT: 15:56:27 INFO - 2015-11-15 15:56:27,932 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49561/tests/dromaeo/cssquery-prototype.html) 15:56:28 INFO - 2015-11-15 15:56:28,517 DEBUG : BROWSER_OUTPUT: RSS: Main: 319881216 15:56:28 INFO - 2015-11-15 15:56:28,518 DEBUG : BROWSER_OUTPUT: 15:59:31 INFO - 2015-11-15 15:59:31,583 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49561/tests/dromaeo/cssquery-yui.html) 15:59:32 INFO - 2015-11-15 15:59:32,167 DEBUG : BROWSER_OUTPUT: RSS: Main: 323661824 15:59:32 INFO - 2015-11-15 15:59:32,167 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,029 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/dromaeo/cssquery-yui.html (next: http://localhost:49561/tests/dromaeo/cssquery-dojo.html) 16:02:35 INFO - 2015-11-15 16:02:35,286 DEBUG : BROWSER_OUTPUT: RSS: Main: 364449792 16:02:35 INFO - 2015-11-15 16:02:35,286 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,286 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:02:35 INFO - 2015-11-15 16:02:35,286 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:02:35 INFO - 2015-11-15 16:02:35,286 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:02:35 INFO - 2015-11-15 16:02:35,288 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:02:35 INFO - 2015-11-15 16:02:35,289 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2767.7509024187825;2797.4125433658933;2814.437112577484;2846.2172902451825;2846.288427893027;4540.500544940062;4664.930026049612;4685.9062818743605;4699.577038066577;4778.068276686047;4530.705504142228;4622.075584883029;4677.953220467794;4690.4371475422995;4694.248920172773;4360.149770794696;4368.650507959355;4429.623482004034;4492.168948744493;4511.887202819939;4345.869623911288;4539.931901021488;4548.431446069241;4579.107074120548;4602.148602508547;4313.568643135693;4405.339199120125;4424.3142312941545;4506.59440650343;4523.909521809562;4328.50222224445;4403.493598236212;4423.690341676084;4426.424564806587;4469.039156581351;4453.576910193527;4463.888402789924;4481.551844815525;4497.797599108048;4497.865064048084;4519.367288579601;4641.930371044403;4708.599769019604;4713.670043096985;4719.764011799431;4804.8318308859025;4868.951310486886;4950.950490495121;4990.3762029746285;5015.548600625924;4859.951400485986;4874.2444921037295;4884.731339776311;4953.628477864175;4953.702777833341;4555.908881822411;4556.179887620227;4609.492955774862;4623.630109591259;4671;5063.341765570526;5094.4141423736;5235.60732945023;5257.447967963309;5266.868328291824;4881.560659540658;4887.828925987645;4903.901921961612;4923.335349727812;4933.087378834927;4928.088303663833;5000.199968005102;5019.42276638184;5021.72380519075;5036.722980236123;4808.326834243208;4861.4895435978715;4882;4930.334404855299;4981.302617633534;4957.330760347307;5010.874728131826;5017.122003649347;5030.220315851049;5059.519345662156;3743.5320584926885;3856.7107466940092;3875.302445559826;3889.805509724559;3961;3519.9296014080087;3542.0436482149676;3566.4293713005795;3575.2670702506443;3607.3867442534834;4710.740909249956;4739.526047395233;4750.192467280571;4765.8093676252565;4781.282807578821;4983.6760610560195;5092.439831618519;5102.36220472441;5103.948960510422;5107.591392688576;4614.330922016289;4668.883277918079;4684.789184486706;4725.10223057618;4749.976250118727;4246.617804397619;4479.238529450001;4489.124620698998;4504;4551.40831691878;5131.717755523482;5218;5227.843164705065;5231.319928409359;5288.206768984683;5062.721550314768;5066.746662666926;5081.64428490017;5095.0574143783515;5190.117679994485;5258.605604579595;5271.1039123348355;5285.44502827213;5341.118715412069;5378.892422151614;4831.154547954165;4953.876153096201;5042.117629414764;5051.924221136613;5054.747262636927;5018.673786203885;5040.395152581714;5132.281480592795;5141.511556402136;5143.485651434976;4932.28481870134;4958.181899986462;4963.851084467472;4964.230544265644;5032.496750324938;4771.332013518179;4892.706437613754;4932.610533644971;4951.950480495293;4961.206207006861;4571.977140114278;4770.475247722678;4833.081714474239;4870.707757534559;4902.4607293197005;4924.212126059813;4926.039422312758;4948.084604348207;4990.80036798524;5006.123928312603;4672.392588963549;4678.742669153229;4806.519348065165;4840.394950631171;4875.317455556154 16:02:35 INFO - 2015-11-15 16:02:35,292 DEBUG : BROWSER_OUTPUT: |1;ext.html;487.22774402571923;489.4835948074782;498.0586691153719;498.8877502561922;514.5009340939292;26800.4639907202;27705.861470692667;33644.15889602761;34260;34835.30329393417;36333;36440.63559364405;36462.635373646255;36649.26701465976;36649.633503664954;7146.499745017851;8032.638531266107;8208;8254.958725206396;8273.62768675408;7184.604846733428;9562.378445401062;9662.468564228964;9717.46553939533;9777.022297770201;9573.329866909318;9574.617015319378;9603.951980240088;9606.951965240163;9681.757956051084;7282.235365286621;7392.889106663404;9560.474173920431;9595.568199431042;9604.2316614671;9309.487978161198;9431.811363772686;9478.620855165786;9521.761955951088;9552.092551207625;33610.663893361;33922.66077339245;34033.6596634033;34342.141446463786;34388.656113438796;2499.4251322195814;2533.5819589767666;2570.4602033572787;2582.0575489946223;2672.692640346366;23894.28317150488;24059.39851503709;24252.1511747088;24310.878445607836;24451.755482445125;2070.7411573553304;2091.1948899673584;2093.8638988465855;2099.800518950697;2112.3029400297864;211534;215739;215767;216110;216464.9176754122;48306.51693483091;48347.516524835;48348.27477587839;48763.756181218865;49161;49007.509924900296;50124.24813627799;50570.74714626403;52790.73604631952;53501.73249133807;11004.39475828821;11008.504617292241;11066.667999960015;11109.888901111048;11132.276402033842;8316.750497485085;8357.456765310235;8410.453320534145;8430.24127828486;8455.95772021136;16222.83777162237;16435.506934791738;16531.421400251173;16536.338546458006;16656.250468728693;7302.379297759644;7545.924540754632;7589.696412143563;7683.0780306363595;7713.382929365637;760.5588758520045;787.3819052044117;824.1634740738156;837.7361131243639;933.3140141995627;23982.28053158408;24027.27918162458;24153.275401737978;24227;24496.632550511757;884.4516399832145;910.349100393222;911.3574929674563;936.2276122199213;1011.5498603121688;12930.482780688855;12955.611331660066;13043.739125217633;13093.41079651418;13136.60590182296;354013;364144;364198;364548;365608;48014.759926200146;48739.75630121898;48756;48791;48830;1191.362620997762;1207.6860016395624;1209.4980583057932;1215.040118306528;1218.2142518075968;23849.481055271386;24889.502209956063;24889.751102488743;25035.248942531754;25420.74579254184;38612.42081368838;38654;40624.390634141106;43635.56364436315;44216.11567768691;248103;249014;254108;254424;255199;23580.764192358543;28241;28253.293667658472;28595;28634.570481442377;28224.71775282303;29209.269768255963;29275.268118297212;34057;35001.474977874845;28685;28979.420411592073;29433;29566.40867182601;29588.112356629335;28834.134975950754;28922.132336029954;29175.270618234714;29404;29430.852845735633;33500.83249583736;34528.82735586306;34759.84883987584;34762.65237347695;35002.824985874904;25920.351991200372;26183;27828.582571261042;27982.580261296505;28091.578626321032;20877.895610522457;20965;21088.523803334232;21138;21138.57722845565 16:02:35 INFO - 2015-11-15 16:02:35,294 DEBUG : BROWSER_OUTPUT: |2;jquery.html;290.09490389983256;292.1979167186075;295.9995216169347;300.7669056481227;300.9503431933731;14729.968902176852;15444.845551544482;15642.983206091596;15661.608459788511;15949.36202551898;10645.217629371577;15407.306671199794;15953.521394358158;16291.348346066172;16594.08732519711;4117.711760176789;4235.237657221699;4275.5296917339065;4337.9566204338025;4845.515448455153;4252.468441444819;4266.509351424579;4297.527272000078;4300.784960751966;4336.566343365654;4215.557366476522;4227.38702888081;4243.766592837393;4259;4294.4202532658;4198.580141985793;4207.579242075799;4232.788360581959;4253.447051883235;4275.102228532012;2647.1793743939247;2727.045534063062;3526.559180102487;3582.0686621478344;3612.8916132516065;10953.945230273797;11125.666230013032;11394;11414.54341826326;11724.120690948213;1507.3593722667822;1548.3264779820702;1608.404890190637;1625.520471460922;1639.2131776747228;8276.21375969288;8363.790905227417;8375.659894416864;8414.78963025923;8563.571821408905;1351.6958684296053;1392.1786146173704;1400.544822932541;1448.1528305941038;1474.402866838932;48793;49487.50512494865;50125.498745012446;50177.74911125421;50769.238461423105;5684.857878552986;5734;5743.59794814359;5744.368119506851;5788.7684492620665;6480.773172938924;6485.221773387224;6501.0573466847045;6502.252240992252;6516.706748196248;4272;4287.185434767384;4355.041890784022;4357.673174511924;4401.603855653007;4365.781710914442;4379.627731642846;4385.6052955233545;4445.2887537993765;4476.283794592915;2534.4170840706743;2592.6370308156875;2599.5450796110604;2600.570905800522;2602.1152808044976;898.128815049401;902.309733054214;906.419891269588;908.2643059122132;958.3516351874764;335.9512870633744;337.63438737129155;368.10733970122345;373.8299073921359;398.1102236501417;9604.135627793392;10305;10307.278490505592;10327.32872363294;10346.482675866177;323.262960450174;393.3666796457701;397.3939741893578;397.6480814479149;403.1694708899676;5362.410134885237;5387.568994480433;5454.318210223722;5455.918161227585;5482.2873026507095;465924;472401;477686;482805;488351;61262;61623;62638;62693;63203.944722245156;442.5220761577553;443.36820031455693;444.4111552193357;444.53546044383694;445.03205527977167;9261.67584134552;9295.907040929775;9339.299552533452;9377.296702747184;9499.097585729345;28868.855655721585;29618.703812961594;29623.555646664885;30212.5468117974;30283;40972.59027409807;41658.79170604127;41780.791096044326;42247;42261;5390.137577987503;5444.6188766785945;5451.155070964007;5451.727413629382;5463.863403414946;10051.798964020825;10073.19414446857;10089.344192627455;10245.436500992517;10370.014848589371;8704.608292626974;8958.507282099286;9016;9024.548772561215;9111.589978450853;8567.27178189861;8732.912670873464;8733.344999125218;8902.777430564287;8965.237954773656;8783.165599268059;8870.068642792672;9144.085591440802;9151.954240228757;9260.212881905114;4664.696794708333;4702.435707715096;4814.44432339287;4849.878753031202;4956.702597844141;7782.299593036654;8384;8737.650493980424;8752.912470875464;8756.956215218883 16:02:35 INFO - 2015-11-15 16:02:35,297 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1270.1870802686283;1277.6805798550363;1295.9740805183897;1348.4336578636971;1660.086952176302;6421.357864213576;6610.768623098193;6901.516893817435;7148.463865210104;7153.24890886456;6881.896771548419;6998.335158159966;7036.085308909835;7116.7509137180205;7117.7508787192455;1911.2068491576015;1934.1586409911663;1937.273522429089;1940.1075505267595;1940.8156225158586;2003.7595488541394;2009.7688765791902;2012.6578481658153;2027.8276346510565;2034.5523984723336;1949.152118828307;1960.6176795524877;1975.2099160335908;1982.484554015959;2018.5660083082134;1944.8541359398032;1955.3742802303268;1964.4204959536899;1966.5083729067733;1990.761108666962;1995.8103980121866;2004.6992951057312;2007.8996050197431;2015.4054553906633;2030.1067530286628;6125.908111378333;6999.755008574726;7003.2296447390745;7008.649567521655;7136.215016348197;4077.8980525486804;4199.286121359346;4370.453693288339;4380.430544029287;4450.265706158512;2511.7237103918555;2526.090607381341;2541.034406925375;2541.1487151804167;2549.1587776033866;771.699037375424;773.7717373374868;791.5171745235402;791.643760307858;813.4793732011517;9165.90834091664;9197.816043679155;9250.028746981538;9254.814903701888;9339.579718912597;3906.941395879064;3912.3349030664854;3929.2337994090876;3953.822078006439;3990.182012687392;8105.067917189481;8115.310198633064;8132.471389359673;8166.469179503313;8212.548309843016;4301.139772045603;4346.456692913386;4413.757243351646;4420.226460369422;4432.069265454226;3941.901452463654;3943.408488726714;3969.563348031714;3993.2612466693754;4023.3562629979065;2929.091981485746;2967.6438827340858;2968.8218706877656;2971.643402791679;3022.471067563212;1062.4793851012948;1070.1171533484905;1072.1529991306936;1078.730317420645;1083.7886612110563;837.623069618674;855.1747563601155;1177.686879129764;1201.2672269915345;1212.9636110916686;6589.538732288694;6613.3056029117215;6635;6642.800715978528;6650.135482387259;415.59894701613086;1082.1559183836462;1105.4859490337033;1133.994330028361;1135.4549816088158;5102.515261050195;5118.897622047538;5239.947600524022;5243.292155558951;5257.710825904612;7815.80460488481;7996.0804507481225;8102.0277566692375;8190.959045204736;8334.249917507454;8193.71322003727;8248.051474080437;8325.084240733515;8413.537255451009;8430.85013321599;6057.697115144225;6187.102870083812;6201.6899155042065;6230;6249.0626406039455;6191.597546159485;6226.159468471698;6227.532935029982;6312.116303717391;6318.715657795502;6771.3905748482875;6912.101426814482;7040.3663670269925;7083.468739844635;7153.35619794221;7098.858022839411;7160.176579693402;7252.238514955854;7325.974363589208;7335.523190992569;5641.40765219646;5714.3999880012;5731.8567035824435;5747.942520574908;5811.82564523065;6808.251092379934;6815.284395138439;6849.2808255132495;6881.724731010703;6919.827004324932;6340.524460665376;6375.649339286384;6390.584612000205;6491.156149700509;6517.217933847968;6163.291221509405;6354.936450635434;6355.936440635534;6364.236291645032;6381.234251889803;6326.462250708557;6437.291897891135;6467.805965821033;6511.153550038654;6522.021696745526;5427.185922111715;5492.752826122754;5496.285482887199;5505.091659876076;5555;5870.853228669317;5880.676562788916;5926.614770039933;5949.702514874152;6024.518038556993 16:02:35 INFO - 2015-11-15 16:02:35,298 DEBUG : BROWSER_OUTPUT: |4;prototype.html;270.94716530276594;281.8745658182109;283.3059005436679;286.98708558114885;288.3670343595808;5535.640183388077;5560.165975103731;5612.07400778871;5620.662760234383;5749.396313387092;5468.6171967962255;5496.258005169301;5504.119340905456;5515.751791169397;5543.390227075029;4257.595528424795;4281.336392859112;4290.892727681801;4295.9785201073955;4316.6546676265825;4044.9595504045024;4138.772367519785;4152;4204.957950420502;4261.744295342274;4155;4232.724872883268;4242.724222925515;4271.252530807112;4288.656907447412;4217.725847819882;4224.831006759726;4226.112516371566;4234.110836724291;4267.997020700133;3516.7889926604485;3557.8221088945706;3572.732045096628;3574.160072382988;3638.945415818765;5287.973560132214;5311.123664595337;5335.759890804923;5366;5416.052190866582;4700.717956922562;4701.670883038189;4732.858014259577;4735.289706544011;4764.904701905943;5669.688167150805;5764.596478246524;5767.480926716574;5776.249087618583;5829.271341082364;3912.8239229234755;3925.2542017016676;3936;4003.1393250451;4005.319095753729;6013.278406591194;6025.15647809307;6032.66820324882;6035.185249991239;6133.907991380132;3986.0234242610168;3996.9200615987515;3997.4403583498333;4017.0517299109906;4058.127502586958;4034.536028356718;4038.5557588665224;4056.817443215062;4062.370332598452;4067.3695577185586;4514.819407223675;4655.930161047587;4659.464161621389;4675.368825208553;4701.694389864648;5799.652020878761;5804.1293805929445;5808.361080281165;5891.027980383275;5892.234009578813;1378.0078343592597;1403.6069900427897;1404.3610157378369;1409.2742237747568;1411.865872742088;892.7187935800332;898.6270697660398;903.1645727701849;912.0332447605559;916.3585490156917;5585.134304182858;5586.357568879631;5588.692621905753;5621.747021383966;5651.152327150878;6041.365656606081;6044.667543285073;6083.4220749029655;6150.138980542728;6150.477209437248;5578.219049333096;5604.467575580314;5612.466815652507;5653.265075540154;5684.63049901755;3159.0996565978585;3175.301433684586;3282.573265475473;3307.9173020674193;3320.5351250824906;6189.566730328834;6230.7507699691505;6246.812595622138;6330.778422755181;6425.839354016187;6277.2781130170615;6284.402981716729;6293.83564040654;6365.872682546323;6372.012338087604;6040.939590604214;6273.0904018917;6284.12022316876;6349.809505714836;6367.649779262092;6039.365866583946;6075.635461872302;6095.603785753912;6129.969350153221;6160.260768707783;5931.288245410578;5936.525077993837;6013.458788709037;6013.548983826143;6021.7591296347655;6277.121203031488;6291.6539590321145;6374.107624932421;6395.136656551492;6399.104125422352;3788.905277368088;3941.5270167580074;3967;3983.3029219886985;4010.137820368518;6010.188624535632;6024.759009639565;6040.161124271585;6077.118817771487;6102.9694851525455;5891.440313170242;5904.527637789052;5940.049592065248;5941.2276404068925;5957.344692083954;5691.146328050825;5860.38465961085;5890.852728681646;5898.675572843363;5926.111083337361;5720.799772007959;5748.223989761496;5810.941890581209;5813.970930145322;5817.563682723898;5838.416158384128;5863.941360586339;5921.703914804157;5942.435468630473;5952.791652292149;5619.80330688424;5744.13837924298;5766.3368712598585;5838.620489668158;5861.6189947653265 16:02:35 INFO - 2015-11-15 16:02:35,300 DEBUG : BROWSER_OUTPUT: |5;yui.html;574.1903915479172;608.2154021312506;610.56039651451;662.6244911990514;675.942544883685;12071.09466789991;12471.438785254662;12479.68800779981;12642.115051946368;12642.494300228003;11470.541178352856;11517.251378660381;11533.365664888428;11539;11627.127965402608;748.745426554974;764.1746913333615;769.6459628570864;775.9728409505668;787.1656044592721;603.8882806680756;610.6366711806468;740.7296336837043;755.2145768400857;767.3630886364305;767.2097739328501;778.2217782217782;782.6517199846071;789.9723509677162;792.0218530115303;614.7203022624695;620.7548018532699;751.4514404484702;773.1842905734447;781.0237203495631;550.6008144095499;563.2086917880384;565.7030059218902;567.1351189436143;568.7071158353451;11614;11714.062874969983;11725.061995040376;11757.412129393497;11781.705457363634;7574.848503029909;7715.267049630276;8026.478278911852;8031.4377993540475;8053.275205231557;7269.709211631528;7474.738384156529;7672.5012874163;7706.884396734054;7866.921330786676;2483.801295896324;2500.3124140861228;2567.33249355169;2580.483903219345;2606.0748434305738;39041.804790976144;39381;39401.40897886534;39401.80299098515;39472.210555788726;5188.273641690166;5190.766415511311;5264.341957255343;5351.25082488452;5509.173623956439;8803.779905502413;8843.557822108998;8873.467591944504;8907.242884354773;8947.3736838422;5423.728813559306;5507.421720719347;5537.778488860481;5540.279763630702;5645.23789288449;3238.305431980249;3360.6807353301397;3360.8655653773576;3376.8649254030056;3379.30724201543;2356.32844639277;2391.3065211088588;2391.995361947986;2410.1805386168785;2419.395151212197;347.0819681941251;348.6478656556896;349.64161734222625;350.6440962423143;355.40647119310813;413.37993010484274;501.9899602007939;528.7726277700625;538.6283464409545;557.8242853501134;6524.804255872332;6647.567908085959;6895.965520172367;6906.758263460755;7044.295570442915;349.4164744876063;434.8847555397822;446.5512160278899;551.2558046637008;562.9324481062299;3251.918702032468;3288.8191149487006;3418.4701371287492;3449.9827500862334;3490.2495963367996;52645;52942.47057529375;53140.46859531433;53325.86696532173;54022.18966715503;46327;46372.53627463682;46764.7661761689;46926;47027.29459058117;41738;42528.57471425308;42738.99999999938;42976.57023429726;43004.784976074916;6508.446782023581;6778.593284402951;6791.626460544718;6902.620355880475;6928.1339832520935;28697.569536457388;29031.85484072566;29396.55905161467;29787.255318617208;31123.37753244968;39296.410553841146;39960.200795983335;39992.4014437256;41032;41092.38361424521;6217.378262173927;6280.026595877646;6299.496040316672;6309.432151106423;6500.837479063061;9202.907970920205;9329.486878221764;9480.431174129575;9633.90366096358;9912.553935072794;9216.2626989842;9294.302927280345;9347.112024357675;9920;10245.282830201815;9370.34407591462;9385.530723463937;9454.858177127486;9597.520123993632;9893;8466;9621.326507144433;9635.277354198322;9655.420674759256;9685.612575496902;6596.472282217507;7849.843003140019;8038.959805201171;8205.220504052106;8437.071922088688;7587;7805.297523222937;7866.410019248465;7910.802229944297;7952.920470795218 16:02:35 INFO - 2015-11-15 16:02:35,300 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:02:35 INFO - 2015-11-15 16:02:35,300 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:02:35 INFO - 2015-11-15 16:02:35,300 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,952 16:02:35 INFO - 2015-11-15 16:02:35,300 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:02:35 INFO - 2015-11-15 16:02:35,301 DEBUG : BROWSER_OUTPUT: __startTimestamp1447632155286__endTimestamp 16:02:35 INFO - 2015-11-15 16:02:35,301 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,301 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:02:35 INFO - 2015-11-15 16:02:35,301 DEBUG : BROWSER_OUTPUT: Number of tests: 6 16:02:35 INFO - 2015-11-15 16:02:35,301 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,301 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4697.14 Median:4808.33 stddev:494.74 (10.3%) stddev-sans-first:472.54 16:02:35 INFO - 2015-11-15 16:02:35,303 DEBUG : BROWSER_OUTPUT: Values: 2767.8 2797.4 2814.4 2846.2 2846.3 4540.5 4664.9 4685.9 4699.6 4778.1 4530.7 4622.1 4678.0 4690.4 4694.2 4360.1 4368.7 4429.6 4492.2 4511.9 4345.9 4539.9 4548.4 4579.1 4602.1 4313.6 4405.3 4424.3 4506.6 4523.9 4328.5 4403.5 4423.7 4426.4 4469.0 4453.6 4463.9 4481.6 4497.8 4497.9 4519.4 4641.9 4708.6 4713.7 4719.8 4804.8 4869.0 4951.0 4990.4 5015.5 4860.0 4874.2 4884.7 4953.6 4953.7 4555.9 4556.2 4609.5 4623.6 4671.0 5063.3 5094.4 5235.6 5257.4 5266.9 4881.6 4887.8 4903.9 4923.3 4933.1 4928.1 5000.2 5019.4 5021.7 5036.7 4808.3 4861.5 4882.0 4930.3 4981.3 4957.3 5010.9 5017.1 5030.2 5059.5 3743.5 3856.7 3875.3 3889.8 3961.0 3519.9 3542.0 3566.4 3575.3 3607.4 4710.7 4739.5 4750.2 4765.8 4781.3 4983.7 5092.4 5102.4 5103.9 5107.6 4614.3 4668.9 4684.8 4725.1 4750.0 4246.6 4479.2 4489.1 4504.0 4551.4 5131.7 5218.0 5227.8 5231.3 5288.2 5062.7 5066.7 5081.6 5095.1 5190.1 5258.6 5271.1 5285.4 5341.1 5378.9 4831.2 4953.9 5042.1 5051.9 5054.7 5018.7 5040.4 5132.3 5141.5 5143.5 4932.3 4958.2 4963.9 4964.2 5032.5 4771.3 4892.7 4932.6 4952.0 4961.2 4572.0 4770.5 4833.1 4870.7 4902.5 4924.2 4926.0 4948.1 4990.8 5006.1 4672.4 4678.7 4806.5 4840.4 4875.3 16:02:35 INFO - 2015-11-15 16:02:35,303 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,303 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:41775.33 Median:34045.33 stddev:74694.52 (219.4%) stddev-sans-first:74839.73 16:02:35 INFO - 2015-11-15 16:02:35,304 DEBUG : BROWSER_OUTPUT: Values: 487.2 489.5 498.1 498.9 514.5 26800.5 27705.9 33644.2 34260.0 34835.3 36333.0 36440.6 36462.6 36649.3 36649.6 7146.5 8032.6 8208.0 8255.0 8273.6 7184.6 9562.4 9662.5 9717.5 9777.0 9573.3 9574.6 9604.0 9607.0 9681.8 7282.2 7392.9 9560.5 9595.6 9604.2 9309.5 9431.8 9478.6 9521.8 9552.1 33610.7 33922.7 34033.7 34342.1 34388.7 2499.4 2533.6 2570.5 2582.1 2672.7 23894.3 24059.4 24252.2 24310.9 24451.8 2070.7 2091.2 2093.9 2099.8 2112.3 211534.0 215739.0 215767.0 216110.0 216464.9 48306.5 48347.5 48348.3 48763.8 49161.0 49007.5 50124.2 50570.7 52790.7 53501.7 11004.4 11008.5 11066.7 11109.9 11132.3 8316.8 8357.5 8410.5 8430.2 8456.0 16222.8 16435.5 16531.4 16536.3 16656.3 7302.4 7545.9 7589.7 7683.1 7713.4 760.6 787.4 824.2 837.7 933.3 23982.3 24027.3 24153.3 24227.0 24496.6 884.5 910.3 911.4 936.2 1011.5 12930.5 12955.6 13043.7 13093.4 13136.6 354013.0 364144.0 364198.0 364548.0 365608.0 48014.8 48739.8 48756.0 48791.0 48830.0 1191.4 1207.7 1209.5 1215.0 1218.2 23849.5 24889.5 24889.8 25035.2 25420.7 38612.4 38654.0 40624.4 43635.6 44216.1 248103.0 249014.0 254108.0 254424.0 255199.0 23580.8 28241.0 28253.3 28595.0 28634.6 28224.7 29209.3 29275.3 34057.0 35001.5 28685.0 28979.4 29433.0 29566.4 29588.1 28834.1 28922.1 29175.3 29404.0 29430.9 33500.8 34528.8 34759.8 34762.7 35002.8 25920.4 26183.0 27828.6 27982.6 28091.6 20877.9 20965.0 21088.5 21138.0 21138.6 16:02:35 INFO - 2015-11-15 16:02:35,304 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,304 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:23367.57 Median:4356.36 stddev:78197.11 (1795.0%) stddev-sans-first:78397.27 16:02:35 INFO - 2015-11-15 16:02:35,306 DEBUG : BROWSER_OUTPUT: Values: 290.1 292.2 296.0 300.8 301.0 14730.0 15444.8 15643.0 15661.6 15949.4 10645.2 15407.3 15953.5 16291.3 16594.1 4117.7 4235.2 4275.5 4338.0 4845.5 4252.5 4266.5 4297.5 4300.8 4336.6 4215.6 4227.4 4243.8 4259.0 4294.4 4198.6 4207.6 4232.8 4253.4 4275.1 2647.2 2727.0 3526.6 3582.1 3612.9 10953.9 11125.7 11394.0 11414.5 11724.1 1507.4 1548.3 1608.4 1625.5 1639.2 8276.2 8363.8 8375.7 8414.8 8563.6 1351.7 1392.2 1400.5 1448.2 1474.4 48793.0 49487.5 50125.5 50177.7 50769.2 5684.9 5734.0 5743.6 5744.4 5788.8 6480.8 6485.2 6501.1 6502.3 6516.7 4272.0 4287.2 4355.0 4357.7 4401.6 4365.8 4379.6 4385.6 4445.3 4476.3 2534.4 2592.6 2599.5 2600.6 2602.1 898.1 902.3 906.4 908.3 958.4 336.0 337.6 368.1 373.8 398.1 9604.1 10305.0 10307.3 10327.3 10346.5 323.3 393.4 397.4 397.6 403.2 5362.4 5387.6 5454.3 5455.9 5482.3 465924.0 472401.0 477686.0 482805.0 488351.0 61262.0 61623.0 62638.0 62693.0 63203.9 442.5 443.4 444.4 444.5 445.0 9261.7 9295.9 9339.3 9377.3 9499.1 28868.9 29618.7 29623.6 30212.5 30283.0 40972.6 41658.8 41780.8 42247.0 42261.0 5390.1 5444.6 5451.2 5451.7 5463.9 10051.8 10073.2 10089.3 10245.4 10370.0 8704.6 8958.5 9016.0 9024.5 9111.6 8567.3 8732.9 8733.3 8902.8 8965.2 8783.2 8870.1 9144.1 9152.0 9260.2 4664.7 4702.4 4814.4 4849.9 4956.7 7782.3 8384.0 8737.7 8752.9 8757.0 16:02:35 INFO - 2015-11-15 16:02:35,306 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,306 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4819.15 Median:5938.16 stddev:2486.10 (41.9%) stddev-sans-first:2478.76 16:02:35 INFO - 2015-11-15 16:02:35,308 DEBUG : BROWSER_OUTPUT: Values: 1270.2 1277.7 1296.0 1348.4 1660.1 6421.4 6610.8 6901.5 7148.5 7153.2 6881.9 6998.3 7036.1 7116.8 7117.8 1911.2 1934.2 1937.3 1940.1 1940.8 2003.8 2009.8 2012.7 2027.8 2034.6 1949.2 1960.6 1975.2 1982.5 2018.6 1944.9 1955.4 1964.4 1966.5 1990.8 1995.8 2004.7 2007.9 2015.4 2030.1 6125.9 6999.8 7003.2 7008.6 7136.2 4077.9 4199.3 4370.5 4380.4 4450.3 2511.7 2526.1 2541.0 2541.1 2549.2 771.7 773.8 791.5 791.6 813.5 9165.9 9197.8 9250.0 9254.8 9339.6 3906.9 3912.3 3929.2 3953.8 3990.2 8105.1 8115.3 8132.5 8166.5 8212.5 4301.1 4346.5 4413.8 4420.2 4432.1 3941.9 3943.4 3969.6 3993.3 4023.4 2929.1 2967.6 2968.8 2971.6 3022.5 1062.5 1070.1 1072.2 1078.7 1083.8 837.6 855.2 1177.7 1201.3 1213.0 6589.5 6613.3 6635.0 6642.8 6650.1 415.6 1082.2 1105.5 1134.0 1135.5 5102.5 5118.9 5239.9 5243.3 5257.7 7815.8 7996.1 8102.0 8191.0 8334.2 8193.7 8248.1 8325.1 8413.5 8430.9 6057.7 6187.1 6201.7 6230.0 6249.1 6191.6 6226.2 6227.5 6312.1 6318.7 6771.4 6912.1 7040.4 7083.5 7153.4 7098.9 7160.2 7252.2 7326.0 7335.5 5641.4 5714.4 5731.9 5747.9 5811.8 6808.3 6815.3 6849.3 6881.7 6919.8 6340.5 6375.6 6390.6 6491.2 6517.2 6163.3 6354.9 6355.9 6364.2 6381.2 6326.5 6437.3 6467.8 6511.2 6522.0 5427.2 5492.8 5496.3 5505.1 5555.0 5870.9 5880.7 5926.6 5949.7 6024.5 16:02:35 INFO - 2015-11-15 16:02:35,308 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,308 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4879.96 Median:5621.20 stddev:1514.48 (26.9%) stddev-sans-first:1478.69 16:02:35 INFO - 2015-11-15 16:02:35,309 DEBUG : BROWSER_OUTPUT: Values: 270.9 281.9 283.3 287.0 288.4 5535.6 5560.2 5612.1 5620.7 5749.4 5468.6 5496.3 5504.1 5515.8 5543.4 4257.6 4281.3 4290.9 4296.0 4316.7 4045.0 4138.8 4152.0 4205.0 4261.7 4155.0 4232.7 4242.7 4271.3 4288.7 4217.7 4224.8 4226.1 4234.1 4268.0 3516.8 3557.8 3572.7 3574.2 3638.9 5288.0 5311.1 5335.8 5366.0 5416.1 4700.7 4701.7 4732.9 4735.3 4764.9 5669.7 5764.6 5767.5 5776.2 5829.3 3912.8 3925.3 3936.0 4003.1 4005.3 6013.3 6025.2 6032.7 6035.2 6133.9 3986.0 3996.9 3997.4 4017.1 4058.1 4034.5 4038.6 4056.8 4062.4 4067.4 4514.8 4655.9 4659.5 4675.4 4701.7 5799.7 5804.1 5808.4 5891.0 5892.2 1378.0 1403.6 1404.4 1409.3 1411.9 892.7 898.6 903.2 912.0 916.4 5585.1 5586.4 5588.7 5621.7 5651.2 6041.4 6044.7 6083.4 6150.1 6150.5 5578.2 5604.5 5612.5 5653.3 5684.6 3159.1 3175.3 3282.6 3307.9 3320.5 6189.6 6230.8 6246.8 6330.8 6425.8 6277.3 6284.4 6293.8 6365.9 6372.0 6040.9 6273.1 6284.1 6349.8 6367.6 6039.4 6075.6 6095.6 6130.0 6160.3 5931.3 5936.5 6013.5 6013.5 6021.8 6277.1 6291.7 6374.1 6395.1 6399.1 3788.9 3941.5 3967.0 3983.3 4010.1 6010.2 6024.8 6040.2 6077.1 6103.0 5891.4 5904.5 5940.0 5941.2 5957.3 5691.1 5860.4 5890.9 5898.7 5926.1 5720.8 5748.2 5810.9 5814.0 5817.6 5838.4 5863.9 5921.7 5942.4 5952.8 5619.8 5744.1 5766.3 5838.6 5861.6 16:02:35 INFO - 2015-11-15 16:02:35,310 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,310 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11482.86 Median:563.07 stddev:14441.60 (2564.8%) stddev-sans-first:14458.88 16:02:35 INFO - 2015-11-15 16:02:35,310 DEBUG : BROWSER_OUTPUT: Values: 574.2 608.2 610.6 662.6 675.9 12071.1 12471.4 12479.7 12642.1 12642.5 11470.5 11517.3 11533.4 11539.0 11627.1 748.7 764.2 769.6 776.0 787.2 603.9 610.6 740.7 755.2 767.4 767.2 778.2 782.7 790.0 792.0 614.7 620.8 751.5 773.2 781.0 550.6 563.2 565.7 567.1 568.7 11614.0 11714.1 11725.1 11757.4 11781.7 7574.8 7715.3 8026.5 8031.4 8053.3 7269.7 7474.7 7672.5 7706.9 7866.9 2483.8 2500.3 2567.3 2580.5 2606.1 39041.8 39381.0 39401.4 39401.8 39472.2 5188.3 5190.8 5264.3 5351.3 5509.2 8803.8 8843.6 8873.5 8907.2 8947.4 5423.7 5507.4 5537.8 5540.3 5645.2 3238.3 3360.7 3360.9 3376.9 3379.3 2356.3 2391.3 2392.0 2410.2 2419.4 347.1 348.6 349.6 350.6 355.4 413.4 502.0 528.8 538.6 557.8 6524.8 6647.6 6896.0 6906.8 7044.3 349.4 434.9 446.6 551.3 562.9 3251.9 3288.8 3418.5 3450.0 3490.2 52645.0 52942.5 53140.5 53325.9 54022.2 46327.0 46372.5 46764.8 46926.0 47027.3 41738.0 42528.6 42739.0 42976.6 43004.8 6508.4 6778.6 6791.6 6902.6 6928.1 28697.6 29031.9 29396.6 29787.3 31123.4 39296.4 39960.2 39992.4 41032.0 41092.4 6217.4 6280.0 6299.5 6309.4 6500.8 9202.9 9329.5 9480.4 9633.9 9912.6 9216.3 9294.3 9347.1 9920.0 10245.3 9370.3 9385.5 9454.9 9597.5 9893.0 8466.0 9621.3 9635.3 9655.4 9685.6 6596.5 7849.8 8039.0 8205.2 8437.1 7587.0 7805.3 7866.4 7910.8 7952.9 16:02:35 INFO - 2015-11-15 16:02:35,310 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:02:35 INFO - 2015-11-15 16:02:35,310 DEBUG : BROWSER_OUTPUT: 16:02:35 INFO - 2015-11-15 16:02:35,989 INFO : Browser exited with error code: 0 16:02:36 INFO - 2015-11-15 16:02:36,020 INFO : Completed test dromaeo_css (00:18:35) 16:02:36 INFO - 2015-11-15 16:02:36,020 INFO : Starting test kraken 16:02:36 INFO - 2015-11-15 16:02:36,021 DEBUG : operating with platform_type : mac_ 16:02:36 INFO - 2015-11-15 16:02:36,021 INFO : Initialising browser for kraken test... 16:02:36 INFO - 2015-11-15 16:02:36,036 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/tmpctTVmU/profile http://localhost:49561/getInfo.html 16:02:38 INFO - 2015-11-15 16:02:38,444 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:02:38 INFO - 2015-11-15 16:02:38,444 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:02:38 INFO - 2015-11-15 16:02:38,444 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:02:38 INFO - 2015-11-15 16:02:38,444 DEBUG : BROWSER_OUTPUT: __metrics 16:02:38 INFO - 2015-11-15 16:02:38,464 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:02:39 INFO - 2015-11-15 16:02:39,220 INFO : Browser initialized. 16:02:39 INFO - 2015-11-15 16:02:39,220 INFO : Running cycle 1/1 for kraken test... 16:02:39 INFO - 2015-11-15 16:02:39,221 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/tmpctTVmU/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:02:51 INFO - 2015-11-15 16:02:51,341 DEBUG : BROWSER_OUTPUT: RSS: Main: 229539840 16:02:51 INFO - 2015-11-15 16:02:51,341 DEBUG : BROWSER_OUTPUT: 16:02:54 INFO - 2015-11-15 16:02:54,089 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49561/tests/kraken/driver.html?testName=audio-beat-detection) 16:02:54 INFO - 2015-11-15 16:02:54,684 DEBUG : BROWSER_OUTPUT: RSS: Main: 285437952 16:02:54 INFO - 2015-11-15 16:02:54,685 DEBUG : BROWSER_OUTPUT: 16:02:57 INFO - 2015-11-15 16:02:57,643 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49561/tests/kraken/driver.html?testName=audio-dft) 16:02:58 INFO - 2015-11-15 16:02:58,228 DEBUG : BROWSER_OUTPUT: RSS: Main: 298889216 16:02:58 INFO - 2015-11-15 16:02:58,228 DEBUG : BROWSER_OUTPUT: 16:03:01 INFO - 2015-11-15 16:03:01,499 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49561/tests/kraken/driver.html?testName=audio-fft) 16:03:02 INFO - 2015-11-15 16:03:02,085 DEBUG : BROWSER_OUTPUT: RSS: Main: 284237824 16:03:02 INFO - 2015-11-15 16:03:02,085 DEBUG : BROWSER_OUTPUT: 16:03:04 INFO - 2015-11-15 16:03:04,290 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49561/tests/kraken/driver.html?testName=audio-oscillator) 16:03:04 INFO - 2015-11-15 16:03:04,870 DEBUG : BROWSER_OUTPUT: RSS: Main: 284721152 16:03:04 INFO - 2015-11-15 16:03:04,870 DEBUG : BROWSER_OUTPUT: 16:03:07 INFO - 2015-11-15 16:03:07,271 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49561/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:03:07 INFO - 2015-11-15 16:03:07,856 DEBUG : BROWSER_OUTPUT: RSS: Main: 285241344 16:03:07 INFO - 2015-11-15 16:03:07,856 DEBUG : BROWSER_OUTPUT: 16:03:11 INFO - 2015-11-15 16:03:11,272 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49561/tests/kraken/driver.html?testName=imaging-darkroom) 16:03:11 INFO - 2015-11-15 16:03:11,867 DEBUG : BROWSER_OUTPUT: RSS: Main: 285556736 16:03:11 INFO - 2015-11-15 16:03:11,867 DEBUG : BROWSER_OUTPUT: 16:03:15 INFO - 2015-11-15 16:03:15,370 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49561/tests/kraken/driver.html?testName=imaging-desaturate) 16:03:15 INFO - 2015-11-15 16:03:15,956 DEBUG : BROWSER_OUTPUT: RSS: Main: 281456640 16:03:15 INFO - 2015-11-15 16:03:15,956 DEBUG : BROWSER_OUTPUT: 16:03:19 INFO - 2015-11-15 16:03:19,125 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49561/tests/kraken/driver.html?testName=json-parse-financial) 16:03:19 INFO - 2015-11-15 16:03:19,709 DEBUG : BROWSER_OUTPUT: RSS: Main: 283389952 16:03:19 INFO - 2015-11-15 16:03:19,710 DEBUG : BROWSER_OUTPUT: 16:03:21 INFO - 2015-11-15 16:03:21,419 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49561/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:03:21 INFO - 2015-11-15 16:03:21,995 DEBUG : BROWSER_OUTPUT: RSS: Main: 319877120 16:03:21 INFO - 2015-11-15 16:03:21,995 DEBUG : BROWSER_OUTPUT: 16:03:23 INFO - 2015-11-15 16:03:23,989 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49561/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:03:24 INFO - 2015-11-15 16:03:24,612 DEBUG : BROWSER_OUTPUT: RSS: Main: 319070208 16:03:24 INFO - 2015-11-15 16:03:24,612 DEBUG : BROWSER_OUTPUT: 16:03:26 INFO - 2015-11-15 16:03:26,905 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49561/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:03:27 INFO - 2015-11-15 16:03:27,490 DEBUG : BROWSER_OUTPUT: RSS: Main: 326209536 16:03:27 INFO - 2015-11-15 16:03:27,491 DEBUG : BROWSER_OUTPUT: 16:03:30 INFO - 2015-11-15 16:03:30,389 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49561/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:03:30 INFO - 2015-11-15 16:03:30,984 DEBUG : BROWSER_OUTPUT: RSS: Main: 327933952 16:03:30 INFO - 2015-11-15 16:03:30,984 DEBUG : BROWSER_OUTPUT: 16:03:33 INFO - 2015-11-15 16:03:33,918 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49561/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:03:34 INFO - 2015-11-15 16:03:34,498 DEBUG : BROWSER_OUTPUT: RSS: Main: 327544832 16:03:34 INFO - 2015-11-15 16:03:34,499 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,395 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49561/tests/kraken/driver.html?testName=ai-astar) 16:03:36 INFO - 2015-11-15 16:03:36,643 DEBUG : BROWSER_OUTPUT: RSS: Main: 386125824 16:03:36 INFO - 2015-11-15 16:03:36,643 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,645 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:03:36 INFO - 2015-11-15 16:03:36,645 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:03:36 INFO - 2015-11-15 16:03:36,645 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |0;ai-astar;117;118;111;115;118;120;126;124;119;130 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;175;152;183;190;148;174;172;148;192;148 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |2;audio-dft;181;187;188;186;181;182;186;187;185;183 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |3;audio-fft;90;83;103;100;81;83;82;100;98;77 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;103;108;163;104;105;104;153;103;99;150 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;135;141;134;140;135;137;141;135;141;138 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;142;148;147;148;143;148;147;146;141;147 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;117;119;117;109;119;109;118;119;119;110 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;63;66;67;69;69;70;70;78;69;69 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;71;77;77;79;82;81;81;82;78;78 16:03:36 INFO - 2015-11-15 16:03:36,646 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;94;97;101;101;101;100;101;102;98;97 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;143;153;155;148;165;145;155;148;148;147 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;162;182;181;183;179;162;184;181;182;163 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;74;79;78;82;84;84;83;83;82;83 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,954 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: __startTimestamp1447632216644__endTimestamp 16:03:36 INFO - 2015-11-15 16:03:36,647 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: Number of tests: 14 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:119.80 Median:119.50 stddev:5.53 (4.6%) stddev-sans-first:5.78 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: Values: 117.0 118.0 111.0 115.0 118.0 120.0 126.0 124.0 119.0 130.0 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:168.20 Median:174.50 stddev:17.77 (10.2%) stddev-sans-first:18.68 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: Values: 175.0 152.0 183.0 190.0 148.0 174.0 172.0 148.0 192.0 148.0 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:184.60 Median:186.00 stddev:2.63 (1.4%) stddev-sans-first:2.45 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: Values: 181.0 187.0 188.0 186.0 181.0 182.0 186.0 187.0 185.0 183.0 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,652 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:89.70 Median:82.50 stddev:9.68 (11.7%) stddev-sans-first:10.27 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: Values: 90.0 83.0 103.0 100.0 81.0 83.0 82.0 100.0 98.0 77.0 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:119.20 Median:129.00 stddev:25.24 (19.6%) stddev-sans-first:26.08 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: Values: 103.0 108.0 163.0 104.0 105.0 104.0 153.0 103.0 99.0 150.0 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:137.70 Median:139.00 stddev:2.87 (2.1%) stddev-sans-first:2.87 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: Values: 135.0 141.0 134.0 140.0 135.0 137.0 141.0 135.0 141.0 138.0 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:145.70 Median:147.00 stddev:2.67 (1.8%) stddev-sans-first:2.47 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: Values: 142.0 148.0 147.0 148.0 143.0 148.0 147.0 146.0 141.0 147.0 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:115.60 Median:118.50 stddev:4.40 (3.7%) stddev-sans-first:4.64 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: Values: 117.0 119.0 117.0 109.0 119.0 109.0 118.0 119.0 119.0 110.0 16:03:36 INFO - 2015-11-15 16:03:36,653 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:69.00 Median:69.00 stddev:3.83 (5.6%) stddev-sans-first:3.39 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: Values: 63.0 66.0 67.0 69.0 69.0 70.0 70.0 78.0 69.0 69.0 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:78.60 Median:80.00 stddev:3.31 (4.1%) stddev-sans-first:2.07 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: Values: 71.0 77.0 77.0 79.0 82.0 81.0 81.0 82.0 78.0 78.0 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:99.20 Median:98.00 stddev:2.57 (2.6%) stddev-sans-first:1.92 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: Values: 94.0 97.0 101.0 101.0 101.0 100.0 101.0 102.0 98.0 97.0 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:150.70 Median:150.50 stddev:6.45 (4.3%) stddev-sans-first:6.21 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: Values: 143.0 153.0 155.0 148.0 165.0 145.0 155.0 148.0 148.0 147.0 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:175.90 Median:181.50 stddev:9.46 (5.2%) stddev-sans-first:8.59 16:03:36 INFO - 2015-11-15 16:03:36,654 DEBUG : BROWSER_OUTPUT: Values: 162.0 182.0 181.0 183.0 179.0 162.0 184.0 181.0 182.0 163.0 16:03:36 INFO - 2015-11-15 16:03:36,655 DEBUG : BROWSER_OUTPUT: 16:03:36 INFO - 2015-11-15 16:03:36,655 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:81.20 Median:83.00 stddev:3.22 (3.9%) stddev-sans-first:2.12 16:03:36 INFO - 2015-11-15 16:03:36,655 DEBUG : BROWSER_OUTPUT: Values: 74.0 79.0 78.0 82.0 84.0 84.0 83.0 83.0 82.0 83.0 16:03:36 INFO - 2015-11-15 16:03:36,655 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:03:36 INFO - 2015-11-15 16:03:36,655 DEBUG : BROWSER_OUTPUT: 16:03:37 INFO - 2015-11-15 16:03:37,400 INFO : Browser exited with error code: 0 16:03:37 INFO - 2015-11-15 16:03:37,454 INFO : Completed test kraken (00:01:01) 16:03:37 INFO - 2015-11-15 16:03:37,454 INFO : Starting test v8_7 16:03:37 INFO - 2015-11-15 16:03:37,454 DEBUG : operating with platform_type : mac_ 16:03:37 INFO - 2015-11-15 16:03:37,455 INFO : Initialising browser for v8_7 test... 16:03:37 INFO - 2015-11-15 16:03:37,469 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/tmpzDVZW2/profile http://localhost:49561/getInfo.html 16:03:39 INFO - 2015-11-15 16:03:39,863 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:03:39 INFO - 2015-11-15 16:03:39,863 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:03:39 INFO - 2015-11-15 16:03:39,863 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:03:39 INFO - 2015-11-15 16:03:39,863 DEBUG : BROWSER_OUTPUT: __metrics 16:03:39 INFO - 2015-11-15 16:03:39,879 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:03:40 INFO - 2015-11-15 16:03:40,654 INFO : Browser initialized. 16:03:40 INFO - 2015-11-15 16:03:40,655 INFO : Running cycle 1/1 for v8_7 test... 16:03:40 INFO - 2015-11-15 16:03:40,655 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/T/tmpzDVZW2/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:03:52 INFO - 2015-11-15 16:03:52,773 DEBUG : BROWSER_OUTPUT: RSS: Main: 229625856 16:03:52 INFO - 2015-11-15 16:03:52,773 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,450 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49561/tests/v8_7/run.html (next: http://localhost:49561/tests/v8_7/run.html) 16:04:15 INFO - 2015-11-15 16:04:15,700 DEBUG : BROWSER_OUTPUT: RSS: Main: 689123328 16:04:15 INFO - 2015-11-15 16:04:15,700 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,700 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:04:15 INFO - 2015-11-15 16:04:15,700 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:04:15 INFO - 2015-11-15 16:04:15,700 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:04:15 INFO - 2015-11-15 16:04:15,700 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:04:15 INFO - 2015-11-15 16:04:15,700 DEBUG : BROWSER_OUTPUT: |0;Richards;189.5016107636915 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;226.1931689662972 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |2;Encrypt;389.25652004671076 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |3;Decrypt;6642.384105960265 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2197.802197802198 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |5;Earley;945.2313503305005 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |6;Boyer;15584.615384615385 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |7;RegExp;34350 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |8;Splay;869.0372940156115 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;6598.684210526316 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: __startTimestamp1447632255698__endTimestamp 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,701 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: Number of tests: 10 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:189.50 Median:189.50 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: Values: 189.5 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:226.19 Median:226.19 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: Values: 226.2 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:389.26 Median:389.26 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: Values: 389.3 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:6642.38 Median:6642.38 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,702 DEBUG : BROWSER_OUTPUT: Values: 6642.4 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2197.80 Median:2197.80 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: Values: 2197.8 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:945.23 Median:945.23 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: Values: 945.2 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:15584.62 Median:15584.62 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: Values: 15584.6 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:34350.00 Median:34350.00 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: Values: 34350.0 16:04:15 INFO - 2015-11-15 16:04:15,703 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,704 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:869.04 Median:869.04 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,704 DEBUG : BROWSER_OUTPUT: Values: 869.0 16:04:15 INFO - 2015-11-15 16:04:15,704 DEBUG : BROWSER_OUTPUT: 16:04:15 INFO - 2015-11-15 16:04:15,704 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:6598.68 Median:6598.68 stddev:0.00 (0.0%) 16:04:15 INFO - 2015-11-15 16:04:15,704 DEBUG : BROWSER_OUTPUT: Values: 6598.7 16:04:15 INFO - 2015-11-15 16:04:15,704 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:04:15 INFO - 2015-11-15 16:04:15,704 DEBUG : BROWSER_OUTPUT: 16:04:16 INFO - 2015-11-15 16:04:16,456 INFO : Browser exited with error code: 0 16:04:16 INFO - 2015-11-15 16:04:16,480 INFO : Completed test v8_7 (00:00:39) 16:04:16 INFO - 2015-11-15 16:04:16,612 INFO : Completed test suite (00:20:15) 16:04:16 INFO - 2015-11-15 16:04:16,613 DEBUG : Working with test: dromaeo_css 16:04:16 INFO - 2015-11-15 16:04:16,613 DEBUG : Generating results file: dromaeo_css 16:04:16 INFO - 2015-11-15 16:04:16,613 DEBUG : Working with test: kraken 16:04:16 INFO - 2015-11-15 16:04:16,614 DEBUG : Generating results file: kraken 16:04:16 INFO - 2015-11-15 16:04:16,614 INFO : javascript benchmark 16:04:16 INFO - 2015-11-15 16:04:16,614 DEBUG : Working with test: v8_7 16:04:16 INFO - 2015-11-15 16:04:16,614 DEBUG : Generating results file: v8_7 16:04:16 INFO - 2015-11-15 16:04:16,614 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:04:16 INFO - 2015-11-15 16:04:16,670 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,63,55]] 16:04:16 INFO - 2015-11-15 16:04:16,670 DEBUG : process_Request line: dromaeo_css 5765.62 graph.html#tests=[[72,63,55]] 16:04:16 INFO - 2015-11-15 16:04:16,670 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:04:16 INFO - 2015-11-15 16:04:16,699 DEBUG : process_Request line: kraken 1735.10 graph.html#tests=[[232,63,55]] 16:04:16 INFO - 2015-11-15 16:04:16,699 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:04:16 INFO - 2015-11-15 16:04:16,730 DEBUG : process_Request line: v8_7 15667.78 graph.html#tests=[[230,63,55]] 16:04:16 INFO - 2015-11-15 16:04:16,731 INFO : javascript benchmark 16:04:16 INFO - 2015-11-15 16:04:16,733 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [290.09490389983256, 292.1979167186075, 295.9995216169347, 300.7669056481227, 300.9503431933731, 14729.968902176852, 15444.845551544482, 15642.983206091596, 15661.608459788511, 15949.36202551898, 10645.217629371577, 15407.306671199794, 15953.521394358158, 16291.348346066172, 16594.08732519711, 4117.711760176789, 4235.237657221699, 4275.5296917339065, 4337.9566204338025, 4845.515448455153, 4252.468441444819, 4266.509351424579, 4297.527272000078, 4300.784960751966, 4336.566343365654, 4215.557366476522, 4227.38702888081, 4243.766592837393, 4259.0, 4294.4202532658, 4198.580141985793, 4207.579242075799, 4232.788360581959, 4253.447051883235, 4275.102228532012, 2647.1793743939247, 2727.045534063062, 3526.559180102487, 3582.0686621478344, 3612.8916132516065, 10953.945230273797, 11125.666230013032, 11394.0, 11414.54341826326, 11724.120690948213, 1507.3593722667822, 1548.3264779820702, 1608.404890190637, 1625.520471460922, 1639.2131776747228, 8276.21375969288, 8363.790905227417, 8375.659894416864, 8414.78963025923, 8563.571821408905, 1351.6958684296053, 1392.1786146173704, 1400.544822932541, 1448.1528305941038, 1474.402866838932, 48793.0, 49487.50512494865, 50125.498745012446, 50177.74911125421, 50769.238461423105, 5684.857878552986, 5734.0, 5743.59794814359, 5744.368119506851, 5788.7684492620665, 6480.773172938924, 6485.221773387224, 6501.0573466847045, 6502.252240992252, 6516.706748196248, 4272.0, 4287.185434767384, 4355.041890784022, 4357.673174511924, 4401.603855653007, 4365.781710914442, 4379.627731642846, 4385.6052955233545, 4445.2887537993765, 4476.283794592915, 2534.4170840706743, 2592.6370308156875, 2599.5450796110604, 2600.570905800522, 2602.1152808044976, 898.128815049401, 902.309733054214, 906.419891269588, 908.2643059122132, 958.3516351874764, 335.9512870633744, 337.63438737129155, 368.10733970122345, 373.8299073921359, 398.1102236501417, 9604.135627793392, 10305.0, 10307.278490505592, 10327.32872363294, 10346.482675866177, 323.262960450174, 393.3666796457701, 397.3939741893578, 397.6480814479149, 403.1694708899676, 5362.410134885237, 5387.568994480433, 5454.318210223722, 5455.918161227585, 5482.2873026507095, 465924.0, 472401.0, 477686.0, 482805.0, 488351.0, 61262.0, 61623.0, 62638.0, 62693.0, 63203.944722245156, 442.5220761577553, 443.36820031455693, 444.4111552193357, 444.53546044383694, 445.03205527977167, 9261.67584134552, 9295.907040929775, 9339.299552533452, 9377.296702747184, 9499.097585729345, 28868.855655721585, 29618.703812961594, 29623.555646664885, 30212.5468117974, 30283.0, 40972.59027409807, 41658.79170604127, 41780.791096044326, 42247.0, 42261.0, 5390.137577987503, 5444.6188766785945, 5451.155070964007, 5451.727413629382, 5463.863403414946, 10051.798964020825, 10073.19414446857, 10089.344192627455, 10245.436500992517, 10370.014848589371, 8704.608292626974, 8958.507282099286, 9016.0, 9024.548772561215, 9111.589978450853, 8567.27178189861, 8732.912670873464, 8733.344999125218, 8902.777430564287, 8965.237954773656, 8783.165599268059, 8870.068642792672, 9144.085591440802, 9151.954240228757, 9260.212881905114, 4664.696794708333, 4702.435707715096, 4814.44432339287, 4849.878753031202, 4956.702597844141, 7782.299593036654, 8384.0, 8737.650493980424, 8752.912470875464, 8756.956215218883], "dojo.html": [2767.7509024187825, 2797.4125433658933, 2814.437112577484, 2846.2172902451825, 2846.288427893027, 4540.500544940062, 4664.930026049612, 4685.9062818743605, 4699.577038066577, 4778.068276686047, 4530.705504142228, 4622.075584883029, 4677.953220467794, 4690.4371475422995, 4694.248920172773, 4360.149770794696, 4368.650507959355, 4429.623482004034, 4492.168948744493, 4511.887202819939, 4345.869623911288, 4539.931901021488, 4548.431446069241, 4579.107074120548, 4602.148602508547, 4313.568643135693, 4405.339199120125, 4424.3142312941545, 4506.59440650343, 4523.909521809562, 4328.50222224445, 4403.493598236212, 4423.690341676084, 4426.424564806587, 4469.039156581351, 4453.576910193527, 4463.888402789924, 4481.551844815525, 4497.797599108048, 4497.865064048084, 4519.367288579601, 4641.930371044403, 4708.599769019604, 4713.670043096985, 4719.764011799431, 4804.8318308859025, 4868.951310486886, 4950.950490495121, 4990.3762029746285, 5015.548600625924, 4859.951400485986, 4874.2444921037295, 4884.731339776311, 4953.628477864175, 4953.702777833341, 4555.908881822411, 4556.179887620227, 4609.492955774862, 4623.630109591259, 4671.0, 5063.341765570526, 5094.4141423736, 5235.60732945023, 5257.447967963309, 5266.868328291824, 4881.560659540658, 4887.828925987645, 4903.901921961612, 4923.335349727812, 4933.087378834927, 4928.088303663833, 5000.199968005102, 5019.42276638184, 5021.72380519075, 5036.722980236123, 4808.326834243208, 4861.4895435978715, 4882.0, 4930.334404855299, 4981.302617633534, 4957.330760347307, 5010.874728131826, 5017.122003649347, 5030.220315851049, 5059.519345662156, 3743.5320584926885, 3856.7107466940092, 3875.302445559826, 3889.805509724559, 3961.0, 3519.9296014080087, 3542.0436482149676, 3566.4293713005795, 3575.2670702506443, 3607.3867442534834, 4710.740909249956, 4739.526047395233, 4750.192467280571, 4765.8093676252565, 4781.282807578821, 4983.6760610560195, 5092.439831618519, 5102.36220472441, 5103.948960510422, 5107.591392688576, 4614.330922016289, 4668.883277918079, 4684.789184486706, 4725.10223057618, 4749.976250118727, 4246.617804397619, 4479.238529450001, 4489.124620698998, 4504.0, 4551.40831691878, 5131.717755523482, 5218.0, 5227.843164705065, 5231.319928409359, 5288.206768984683, 5062.721550314768, 5066.746662666926, 5081.64428490017, 5095.0574143783515, 5190.117679994485, 5258.605604579595, 5271.1039123348355, 5285.44502827213, 5341.118715412069, 5378.892422151614, 4831.154547954165, 4953.876153096201, 5042.117629414764, 5051.924221136613, 5054.747262636927, 5018.673786203885, 5040.395152581714, 5132.281480592795, 5141.511556402136, 5143.485651434976, 4932.28481870134, 4958.181899986462, 4963.851084467472, 4964.230544265644, 5032.496750324938, 4771.332013518179, 4892.706437613754, 4932.610533644971, 4951.950480495293, 4961.206207006861, 4571.977140114278, 4770.475247722678, 4833.081714474239, 4870.707757534559, 4902.4607293197005, 4924.212126059813, 4926.039422312758, 4948.084604348207, 4990.80036798524, 5006.123928312603, 4672.392588963549, 4678.742669153229, 4806.519348065165, 4840.394950631171, 4875.317455556154], "mootools.html": [1270.1870802686283, 1277.6805798550363, 1295.9740805183897, 1348.4336578636971, 1660.086952176302, 6421.357864213576, 6610.768623098193, 6901.516893817435, 7148.463865210104, 7153.24890886456, 6881.896771548419, 6998.335158159966, 7036.085308909835, 7116.7509137180205, 7117.7508787192455, 1911.2068491576015, 1934.1586409911663, 1937.273522429089, 1940.1075505267595, 1940.8156225158586, 2003.7595488541394, 2009.7688765791902, 2012.6578481658153, 2027.8276346510565, 2034.5523984723336, 1949.152118828307, 1960.6176795524877, 1975.2099160335908, 1982.484554015959, 2018.5660083082134, 1944.8541359398032, 1955.3742802303268, 1964.4204959536899, 1966.5083729067733, 1990.761108666962, 1995.8103980121866, 2004.6992951057312, 2007.8996050197431, 2015.4054553906633, 2030.1067530286628, 6125.908111378333, 6999.755008574726, 7003.2296447390745, 7008.649567521655, 7136.215016348197, 4077.8980525486804, 4199.286121359346, 4370.453693288339, 4380.430544029287, 4450.265706158512, 2511.7237103918555, 2526.090607381341, 2541.034406925375, 2541.1487151804167, 2549.1587776033866, 771.699037375424, 773.7717373374868, 791.5171745235402, 791.643760307858, 813.4793732011517, 9165.90834091664, 9197.816043679155, 9250.028746981538, 9254.814903701888, 9339.579718912597, 3906.941395879064, 3912.3349030664854, 3929.2337994090876, 3953.822078006439, 3990.182012687392, 8105.067917189481, 8115.310198633064, 8132.471389359673, 8166.469179503313, 8212.548309843016, 4301.139772045603, 4346.456692913386, 4413.757243351646, 4420.226460369422, 4432.069265454226, 3941.901452463654, 3943.408488726714, 3969.563348031714, 3993.2612466693754, 4023.3562629979065, 2929.091981485746, 2967.6438827340858, 2968.8218706877656, 2971.643402791679, 3022.471067563212, 1062.4793851012948, 1070.1171533484905, 1072.1529991306936, 1078.730317420645, 1083.7886612110563, 837.623069618674, 855.1747563601155, 1177.686879129764, 1201.2672269915345, 1212.9636110916686, 6589.538732288694, 6613.3056029117215, 6635.0, 6642.800715978528, 6650.135482387259, 415.59894701613086, 1082.1559183836462, 1105.4859490337033, 1133.994330028361, 1135.4549816088158, 5102.515261050195, 5118.897622047538, 5239.947600524022, 5243.292155558951, 5257.710825904612, 7815.80460488481, 7996.0804507481225, 8102.0277566692375, 8190.959045204736, 8334.249917507454, 8193.71322003727, 8248.051474080437, 8325.084240733515, 8413.537255451009, 8430.85013321599, 6057.697115144225, 6187.102870083812, 6201.6899155042065, 6230.0, 6249.0626406039455, 6191.597546159485, 6226.159468471698, 6227.532935029982, 6312.116303717391, 6318.715657795502, 6771.3905748482875, 6912.101426814482, 7040.3663670269925, 7083.468739844635, 7153.35619794221, 7098.858022839411, 7160.176579693402, 7252.238514955854, 7325.974363589208, 7335.523190992569, 5641.40765219646, 5714.3999880012, 5731.8567035824435, 5747.942520574908, 5811.82564523065, 6808.251092379934, 6815.284395138439, 6849.2808255132495, 6881.724731010703, 6919.827004324932, 6340.524460665376, 6375.649339286384, 6390.584612000205, 6491.156149700509, 6517.217933847968, 6163.291221509405, 6354.936450635434, 6355.936440635534, 6364.236291645032, 6381.234251889803, 6326.462250708557, 6437.291897891135, 6467.805965821033, 6511.153550038654, 6522.021696745526, 5427.185922111715, 5492.752826122754, 5496.285482887199, 5505.091659876076, 5555.0, 5870.853228669317, 5880.676562788916, 5926.614770039933, 5949.702514874152, 6024.518038556993], "ext.html": [487.22774402571923, 489.4835948074782, 498.0586691153719, 498.8877502561922, 514.5009340939292, 26800.4639907202, 27705.861470692667, 33644.15889602761, 34260.0, 34835.30329393417, 36333.0, 36440.63559364405, 36462.635373646255, 36649.26701465976, 36649.633503664954, 7146.499745017851, 8032.638531266107, 8208.0, 8254.958725206396, 8273.62768675408, 7184.604846733428, 9562.378445401062, 9662.468564228964, 9717.46553939533, 9777.022297770201, 9573.329866909318, 9574.617015319378, 9603.951980240088, 9606.951965240163, 9681.757956051084, 7282.235365286621, 7392.889106663404, 9560.474173920431, 9595.568199431042, 9604.2316614671, 9309.487978161198, 9431.811363772686, 9478.620855165786, 9521.761955951088, 9552.092551207625, 33610.663893361, 33922.66077339245, 34033.6596634033, 34342.141446463786, 34388.656113438796, 2499.4251322195814, 2533.5819589767666, 2570.4602033572787, 2582.0575489946223, 2672.692640346366, 23894.28317150488, 24059.39851503709, 24252.1511747088, 24310.878445607836, 24451.755482445125, 2070.7411573553304, 2091.1948899673584, 2093.8638988465855, 2099.800518950697, 2112.3029400297864, 211534.0, 215739.0, 215767.0, 216110.0, 216464.9176754122, 48306.51693483091, 48347.516524835, 48348.27477587839, 48763.756181218865, 49161.0, 49007.509924900296, 50124.24813627799, 50570.74714626403, 52790.73604631952, 53501.73249133807, 11004.39475828821, 11008.504617292241, 11066.667999960015, 11109.888901111048, 11132.276402033842, 8316.750497485085, 8357.456765310235, 8410.453320534145, 8430.24127828486, 8455.95772021136, 16222.83777162237, 16435.506934791738, 16531.421400251173, 16536.338546458006, 16656.250468728693, 7302.379297759644, 7545.924540754632, 7589.696412143563, 7683.0780306363595, 7713.382929365637, 760.5588758520045, 787.3819052044117, 824.1634740738156, 837.7361131243639, 933.3140141995627, 23982.28053158408, 24027.27918162458, 24153.275401737978, 24227.0, 24496.632550511757, 884.4516399832145, 910.349100393222, 911.3574929674563, 936.2276122199213, 1011.5498603121688, 12930.482780688855, 12955.611331660066, 13043.739125217633, 13093.41079651418, 13136.60590182296, 354013.0, 364144.0, 364198.0, 364548.0, 365608.0, 48014.759926200146, 48739.75630121898, 48756.0, 48791.0, 48830.0, 1191.362620997762, 1207.6860016395624, 1209.4980583057932, 1215.040118306528, 1218.2142518075968, 23849.481055271386, 24889.502209956063, 24889.751102488743, 25035.248942531754, 25420.74579254184, 38612.42081368838, 38654.0, 40624.390634141106, 43635.56364436315, 44216.11567768691, 248103.0, 249014.0, 254108.0, 254424.0, 255199.0, 23580.764192358543, 28241.0, 28253.293667658472, 28595.0, 28634.570481442377, 28224.71775282303, 29209.269768255963, 29275.268118297212, 34057.0, 35001.474977874845, 28685.0, 28979.420411592073, 29433.0, 29566.40867182601, 29588.112356629335, 28834.134975950754, 28922.132336029954, 29175.270618234714, 29404.0, 29430.852845735633, 33500.83249583736, 34528.82735586306, 34759.84883987584, 34762.65237347695, 35002.824985874904, 25920.351991200372, 26183.0, 27828.582571261042, 27982.580261296505, 28091.578626321032, 20877.895610522457, 20965.0, 21088.523803334232, 21138.0, 21138.57722845565], "prototype.html": [270.94716530276594, 281.8745658182109, 283.3059005436679, 286.98708558114885, 288.3670343595808, 5535.640183388077, 5560.165975103731, 5612.07400778871, 5620.662760234383, 5749.396313387092, 5468.6171967962255, 5496.258005169301, 5504.119340905456, 5515.751791169397, 5543.390227075029, 4257.595528424795, 4281.336392859112, 4290.892727681801, 4295.9785201073955, 4316.6546676265825, 4044.9595504045024, 4138.772367519785, 4152.0, 4204.957950420502, 4261.744295342274, 4155.0, 4232.724872883268, 4242.724222925515, 4271.252530807112, 4288.656907447412, 4217.725847819882, 4224.831006759726, 4226.112516371566, 4234.110836724291, 4267.997020700133, 3516.7889926604485, 3557.8221088945706, 3572.732045096628, 3574.160072382988, 3638.945415818765, 5287.973560132214, 5311.123664595337, 5335.759890804923, 5366.0, 5416.052190866582, 4700.717956922562, 4701.670883038189, 4732.858014259577, 4735.289706544011, 4764.904701905943, 5669.688167150805, 5764.596478246524, 5767.480926716574, 5776.249087618583, 5829.271341082364, 3912.8239229234755, 3925.2542017016676, 3936.0, 4003.1393250451, 4005.319095753729, 6013.278406591194, 6025.15647809307, 6032.66820324882, 6035.185249991239, 6133.907991380132, 3986.0234242610168, 3996.9200615987515, 3997.4403583498333, 4017.0517299109906, 4058.127502586958, 4034.536028356718, 4038.5557588665224, 4056.817443215062, 4062.370332598452, 4067.3695577185586, 4514.819407223675, 4655.930161047587, 4659.464161621389, 4675.368825208553, 4701.694389864648, 5799.652020878761, 5804.1293805929445, 5808.361080281165, 5891.027980383275, 5892.234009578813, 1378.0078343592597, 1403.6069900427897, 1404.3610157378369, 1409.2742237747568, 1411.865872742088, 892.7187935800332, 898.6270697660398, 903.1645727701849, 912.0332447605559, 916.3585490156917, 5585.134304182858, 5586.357568879631, 5588.692621905753, 5621.747021383966, 5651.152327150878, 6041.365656606081, 6044.667543285073, 6083.4220749029655, 6150.138980542728, 6150.477209437248, 5578.219049333096, 5604.467575580314, 5612.466815652507, 5653.265075540154, 5684.63049901755, 3159.0996565978585, 3175.301433684586, 3282.573265475473, 3307.9173020674193, 3320.5351250824906, 6189.566730328834, 6230.7507699691505, 6246.812595622138, 6330.778422755181, 6425.839354016187, 6277.2781130170615, 6284.402981716729, 6293.83564040654, 6365.872682546323, 6372.012338087604, 6040.939590604214, 6273.0904018917, 6284.12022316876, 6349.809505714836, 6367.649779262092, 6039.365866583946, 6075.635461872302, 6095.603785753912, 6129.969350153221, 6160.260768707783, 5931.288245410578, 5936.525077993837, 6013.458788709037, 6013.548983826143, 6021.7591296347655, 6277.121203031488, 6291.6539590321145, 6374.107624932421, 6395.136656551492, 6399.104125422352, 3788.905277368088, 3941.5270167580074, 3967.0, 3983.3029219886985, 4010.137820368518, 6010.188624535632, 6024.759009639565, 6040.161124271585, 6077.118817771487, 6102.9694851525455, 5891.440313170242, 5904.527637789052, 5940.049592065248, 5941.2276404068925, 5957.344692083954, 5691.146328050825, 5860.38465961085, 5890.852728681646, 5898.675572843363, 5926.111083337361, 5720.799772007959, 5748.223989761496, 5810.941890581209, 5813.970930145322, 5817.563682723898, 5838.416158384128, 5863.941360586339, 5921.703914804157, 5942.435468630473, 5952.791652292149, 5619.80330688424, 5744.13837924298, 5766.3368712598585, 5838.620489668158, 5861.6189947653265], "yui.html": [574.1903915479172, 608.2154021312506, 610.56039651451, 662.6244911990514, 675.942544883685, 12071.09466789991, 12471.438785254662, 12479.68800779981, 12642.115051946368, 12642.494300228003, 11470.541178352856, 11517.251378660381, 11533.365664888428, 11539.0, 11627.127965402608, 748.745426554974, 764.1746913333615, 769.6459628570864, 775.9728409505668, 787.1656044592721, 603.8882806680756, 610.6366711806468, 740.7296336837043, 755.2145768400857, 767.3630886364305, 767.2097739328501, 778.2217782217782, 782.6517199846071, 789.9723509677162, 792.0218530115303, 614.7203022624695, 620.7548018532699, 751.4514404484702, 773.1842905734447, 781.0237203495631, 550.6008144095499, 563.2086917880384, 565.7030059218902, 567.1351189436143, 568.7071158353451, 11614.0, 11714.062874969983, 11725.061995040376, 11757.412129393497, 11781.705457363634, 7574.848503029909, 7715.267049630276, 8026.478278911852, 8031.4377993540475, 8053.275205231557, 7269.709211631528, 7474.738384156529, 7672.5012874163, 7706.884396734054, 7866.921330786676, 2483.801295896324, 2500.3124140861228, 2567.33249355169, 2580.483903219345, 2606.0748434305738, 39041.804790976144, 39381.0, 39401.40897886534, 39401.80299098515, 39472.210555788726, 5188.273641690166, 5190.766415511311, 5264.341957255343, 5351.25082488452, 5509.173623956439, 8803.779905502413, 8843.557822108998, 8873.467591944504, 8907.242884354773, 8947.3736838422, 5423.728813559306, 5507.421720719347, 5537.778488860481, 5540.279763630702, 5645.23789288449, 3238.305431980249, 3360.6807353301397, 3360.8655653773576, 3376.8649254030056, 3379.30724201543, 2356.32844639277, 2391.3065211088588, 2391.995361947986, 2410.1805386168785, 2419.395151212197, 347.0819681941251, 348.6478656556896, 349.64161734222625, 350.6440962423143, 355.40647119310813, 413.37993010484274, 501.9899602007939, 528.7726277700625, 538.6283464409545, 557.8242853501134, 6524.804255872332, 6647.567908085959, 6895.965520172367, 6906.758263460755, 7044.295570442915, 349.4164744876063, 434.8847555397822, 446.5512160278899, 551.2558046637008, 562.9324481062299, 3251.918702032468, 3288.8191149487006, 3418.4701371287492, 3449.9827500862334, 3490.2495963367996, 52645.0, 52942.47057529375, 53140.46859531433, 53325.86696532173, 54022.18966715503, 46327.0, 46372.53627463682, 46764.7661761689, 46926.0, 47027.29459058117, 41738.0, 42528.57471425308, 42738.99999999938, 42976.57023429726, 43004.784976074916, 6508.446782023581, 6778.593284402951, 6791.626460544718, 6902.620355880475, 6928.1339832520935, 28697.569536457388, 29031.85484072566, 29396.55905161467, 29787.255318617208, 31123.37753244968, 39296.410553841146, 39960.200795983335, 39992.4014437256, 41032.0, 41092.38361424521, 6217.378262173927, 6280.026595877646, 6299.496040316672, 6309.432151106423, 6500.837479063061, 9202.907970920205, 9329.486878221764, 9480.431174129575, 9633.90366096358, 9912.553935072794, 9216.2626989842, 9294.302927280345, 9347.112024357675, 9920.0, 10245.282830201815, 9370.34407591462, 9385.530723463937, 9454.858177127486, 9597.520123993632, 9893.0, 8466.0, 9621.326507144433, 9635.277354198322, 9655.420674759256, 9685.612575496902, 6596.472282217507, 7849.843003140019, 8038.959805201171, 8205.220504052106, 8437.071922088688, 7587.0, 7805.297523222937, 7866.410019248465, 7910.802229944297, 7952.920470795218]}, "summary": {"lowerIsBetter": false, "suite": 5765.622751487894, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 5771.102807027175, "unit": "ms", "value": 5771.102807027175}, "dojo.html": {"lowerIsBetter": false, "filtered": 4666.533032481859, "unit": "ms", "value": 4666.533032481859}, "mootools.html": {"lowerIsBetter": false, "filtered": 3952.047159556122, "unit": "ms", "value": 3952.047159556122}, "ext.html": {"lowerIsBetter": false, "filtered": 15893.853122433817, "unit": "ms", "value": 15893.853122433817}, "prototype.html": {"lowerIsBetter": false, "filtered": 4369.987974569687, "unit": "ms", "value": 4369.987974569687}, "yui.html": {"lowerIsBetter": false, "filtered": 4968.8085900061005, "unit": "ms", "value": 4968.8085900061005}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0052"}, "testrun": {"date": 1447631040, "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": "20151115145733", "branch": "Mozilla-Inbound", "revision": "874285de3dc7729fbda40aad190660249bcca527"}}, {"talos_counters": {}, "results": {"audio-dft": [181.0, 187.0, 188.0, 186.0, 181.0, 182.0, 186.0, 187.0, 185.0, 183.0], "ai-astar": [117.0, 118.0, 111.0, 115.0, 118.0, 120.0, 126.0, 124.0, 119.0, 130.0], "imaging-gaussian-blur": [135.0, 141.0, 134.0, 140.0, 135.0, 137.0, 141.0, 135.0, 141.0, 138.0], "audio-beat-detection": [175.0, 152.0, 183.0, 190.0, 148.0, 174.0, 172.0, 148.0, 192.0, 148.0], "json-stringify-tinderbox": [71.0, 77.0, 77.0, 79.0, 82.0, 81.0, 81.0, 82.0, 78.0, 78.0], "stanford-crypto-pbkdf2": [162.0, 182.0, 181.0, 183.0, 179.0, 162.0, 184.0, 181.0, 182.0, 163.0], "json-parse-financial": [63.0, 66.0, 67.0, 69.0, 69.0, 70.0, 70.0, 78.0, 69.0, 69.0], "stanford-crypto-sha256-iterative": [74.0, 79.0, 78.0, 82.0, 84.0, 84.0, 83.0, 83.0, 82.0, 83.0], "audio-fft": [90.0, 83.0, 103.0, 100.0, 81.0, 83.0, 82.0, 100.0, 98.0, 77.0], "imaging-darkroom": [142.0, 148.0, 147.0, 148.0, 143.0, 148.0, 147.0, 146.0, 141.0, 147.0], "stanford-crypto-ccm": [143.0, 153.0, 155.0, 148.0, 165.0, 145.0, 155.0, 148.0, 148.0, 147.0], "audio-oscillator": [103.0, 108.0, 163.0, 104.0, 105.0, 104.0, 153.0, 103.0, 99.0, 150.0], "stanford-crypto-aes": [94.0, 97.0, 101.0, 101.0, 101.0, 100.0, 101.0, 102.0, 98.0, 97.0], "imaging-desaturate": [117.0, 119.0, 117.0, 109.0, 119.0, 109.0, 118.0, 119.0, 119.0, 110.0]}, "summary": {"lowerIsBetter": true, "suite": 1735.1000000000001, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 89.7, "unit": "ms", "value": 89.7}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 175.9, "unit": "ms", "value": 175.9}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 168.2, "unit": "ms", "value": 168.2}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 150.7, "unit": "ms", "value": 150.7}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 145.7, "unit": "ms", "value": 145.7}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 69.0, "unit": "ms", "value": 69.0}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 119.2, "unit": "ms", "value": 119.2}, "ai-astar": {"lowerIsBetter": true, "filtered": 119.8, "unit": "ms", "value": 119.8}, "audio-dft": {"lowerIsBetter": true, "filtered": 184.6, "unit": "ms", "value": 184.6}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 81.2, "unit": "ms", "value": 81.2}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 78.6, "unit": "ms", "value": 78.6}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 137.7, "unit": "ms", "value": 137.7}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 99.2, "unit": "ms", "value": 99.2}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 115.6, "unit": "ms", "value": 115.6}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0052"}, "testrun": {"date": 1447631040, "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": "20151115145733", "branch": "Mozilla-Inbound", "revision": "874285de3dc7729fbda40aad190660249bcca527"}}, {"talos_counters": {}, "results": {"DeltaBlue": [226.1931689662972], "Encrypt": [389.25652004671076], "NavierStokes": [6598.684210526316], "Decrypt": [6642.384105960265], "Splay": [869.0372940156115], "Richards": [189.5016107636915], "RegExp": [34350.0], "Earley": [945.2313503305005], "Boyer": [15584.615384615385], "RayTrace": [2197.802197802198]}, "summary": {"lowerIsBetter": false, "suite": 15667.779849055378, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 292.3076779999999, "unit": "score", "value": 292.3076779999999}, "Encrypt": {"lowerIsBetter": false, "filtered": 683.818989, "unit": "score", "value": 683.818989}, "NavierStokes": {"lowerIsBetter": false, "filtered": 224.8933200398803, "unit": "score", "value": 224.8933200398803}, "Decrypt": {"lowerIsBetter": false, "filtered": 40.07311166500499, "unit": "score", "value": 40.07311166500499}, "Splay": {"lowerIsBetter": false, "filtered": 93.77157984031938, "unit": "score", "value": 93.77157984031938}, "RegExp": {"lowerIsBetter": false, "filtered": 26.520669577874795, "unit": "score", "value": 26.520669577874795}, "Richards": {"lowerIsBetter": false, "filtered": 186.28865399999992, "unit": "score", "value": 186.28865399999992}, "Earley": {"lowerIsBetter": false, "filtered": 705.0792377622378, "unit": "score", "value": 705.0792377622378}, "Boyer": {"lowerIsBetter": false, "filtered": 42.76416090819347, "unit": "score", "value": 42.76416090819347}, "RayTrace": {"lowerIsBetter": false, "filtered": 336.69499499999984, "unit": "score", "value": 336.69499499999984}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0052"}, "testrun": {"date": 1447631040, "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": "20151115145733", "branch": "Mozilla-Inbound", "revision": "874285de3dc7729fbda40aad190660249bcca527"}}] 16:04:16 INFO - RETURN: dromaeo_css: 5765.62 16:04:16 INFO - RETURN: kraken: 1735.10 16:04:16 INFO - RETURN: v8_7: 15667.78 16:04:16 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,63,55]]", "result": "15667.78"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,63,55]]", "result": "1735.10"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,63,55]]", "result": "5765.62"}}} 16:04:16 INFO - Return code: 0 16:04:16 INFO - # TBPL SUCCESS # 16:04:16 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:04:16 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:04:16 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:04:16 INFO - 2015-11-15 16:04:16.849 screenresolution[2311:20425] starting screenresolution argv=screenresolution get 16:04:16 INFO - 2015-11-15 16:04:16.853 screenresolution[2311:20425] Display 0: 1600x1200x32@60 16:04:16 INFO - 2015-11-15 16:04:16.860 screenresolution[2312:20428] starting screenresolution argv=screenresolution list 16:04:16 INFO - Available Modes on Display 0 16:04:16 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:04:16 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:04:16 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:04:16 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:04:17 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:04:17 INFO - Intel HD Graphics 3000: 16:04:17 INFO - Chipset Model: Intel HD Graphics 3000 16:04:17 INFO - Type: GPU 16:04:17 INFO - Bus: Built-In 16:04:17 INFO - VRAM (Total): 512 MB 16:04:17 INFO - VRAM (Dynamic, Max): 10 16:04:17 INFO - Vendor: Intel (0x8086) 16:04:17 INFO - Device ID: 0x0116 16:04:17 INFO - Revision ID: 0x0009 16:04:17 INFO - Displays: 16:04:17 INFO - Display: 16:04:17 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:04:17 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:04:17 INFO - Display Serial Number: 1600x1200 60 16:04:17 INFO - Main Display: Yes 16:04:17 INFO - Mirror: Off 16:04:17 INFO - Online: Yes 16:04:17 INFO - Rotation: Supported 16:04:17 INFO - Return code: 0 16:04:17 INFO - Running post-action listener: _resource_record_post_action 16:04:17 INFO - Running post-run listener: _resource_record_post_run 16:04:18 INFO - Total resource usage - Wall time: 1258s; CPU: 30.0%; Read bytes: 2678784; Write bytes: 686314496; Read time: 112; Write time: 53371 16:04:18 INFO - install - Wall time: 41s; CPU: 30.0%; Read bytes: 336609792; Write bytes: 334125056; Read time: 34956; Write time: 5045 16:04:18 INFO - run-tests - Wall time: 1217s; CPU: 30.0%; Read bytes: 2670592; Write bytes: 341818368; Read time: 91; Write time: 47569 16:04:18 INFO - Running post-run listener: _upload_blobber_files 16:04:18 INFO - Blob upload gear active. 16:04:18 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 16:04:18 INFO - Copying logs to upload dir... 16:04:18 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1311.750705 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 51 secs) (at 2015-11-15 16:04:18.287794) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-15 16:04:18.291724) ========= 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.gGhMzv2K8b/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.85kEBoicDC/Listeners TMPDIR=/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010388 build_url: 'https://queue.taskcluster.net/v1/task/SZlQ8-YvRNumcKKYD_xomA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-15 16:04:18.319253) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 16:04:18.319631) ========= 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.gGhMzv2K8b/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.85kEBoicDC/Listeners TMPDIR=/var/folders/35/xydj_qfn10ngq8grvh_2z8dh00000w/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.005592 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-15 16:04:18.369636) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-15 16:04:18.369997) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-15 16:04:18.370497) ========= ========= Total master_lag: 0.32 =========