builder: fx-team_yosemite_test-dromaeojs-e10s slave: t-yosemite-r5-0018 starttime: 1447261854.46 results: success (0) buildid: 20151111072232 builduid: 7d0fc8b47ffa4192843cf850914bea10 revision: db82f47b94a2aaf03968870c936452d38820bcf8 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.457436) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.458103) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.458431) ========= 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.Tk61uT9sXx/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.4catTHUZol/Listeners TMPDIR=/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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.006393 basedir: '/builds/slave/test' ========= master_lag: 0.04 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.504649) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.505171) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.523659) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.524107) ========= 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.Tk61uT9sXx/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.4catTHUZol/Listeners TMPDIR=/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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.005757 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.574898) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.575300) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.575774) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.576112) ========= 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.Tk61uT9sXx/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.4catTHUZol/Listeners TMPDIR=/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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-11 09:10:54-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 1.26G=0s 2015-11-11 09:10:54 (1.26 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.119001 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.714076) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.714559) ========= 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.Tk61uT9sXx/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.4catTHUZol/Listeners TMPDIR=/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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.021764 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.766350) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:54.766783) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev db82f47b94a2aaf03968870c936452d38820bcf8 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev db82f47b94a2aaf03968870c936452d38820bcf8 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.Tk61uT9sXx/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.4catTHUZol/Listeners TMPDIR=/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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-11 09:10:54,844 truncating revision to first 12 chars 2015-11-11 09:10:54,845 Setting DEBUG logging. 2015-11-11 09:10:54,845 attempt 1/10 2015-11-11 09:10:54,845 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/db82f47b94a2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-11 09:10:55,127 unpacking tar archive at: fx-team-db82f47b94a2/testing/mozharness/ program finished with exit code 0 elapsedTime=0.707324 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:55.492181) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:55.492700) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:55.507178) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:55.507623) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 09:10:55.508197) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 43 mins, 23 secs) (at 2015-11-11 09:10:55.508561) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.Tk61uT9sXx/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.4catTHUZol/Listeners TMPDIR=/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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 09:10:55 INFO - MultiFileLogger online at 20151111 09:10:55 in /builds/slave/test 09:10:55 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 09:10:55 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:10:55 INFO - {'append_to_log': False, 09:10:55 INFO - 'base_work_dir': '/builds/slave/test', 09:10:55 INFO - 'blob_upload_branch': 'Fx-Team', 09:10:55 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:10:55 INFO - 'branch': 'Fx-Team', 09:10:55 INFO - 'buildbot_json_path': 'buildprops.json', 09:10:55 INFO - 'config_files': ('talos/mac_config.py',), 09:10:55 INFO - 'default_actions': ('clobber', 09:10:55 INFO - 'read-buildbot-config', 09:10:55 INFO - 'download-and-extract', 09:10:55 INFO - 'populate-webroot', 09:10:55 INFO - 'create-virtualenv', 09:10:55 INFO - 'install', 09:10:55 INFO - 'run-tests'), 09:10:55 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:10:55 INFO - 'download_minidump_stackwalk': True, 09:10:55 INFO - 'download_symbols': 'ondemand', 09:10:55 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:10:55 INFO - 'tooltool.py': '/tools/tooltool.py', 09:10:55 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:10:55 INFO - '/tools/misc-python/virtualenv.py')}, 09:10:55 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:10:55 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:10:55 INFO - 'installer_path': 'installer.exe', 09:10:55 INFO - 'log_level': 'info', 09:10:55 INFO - 'log_name': 'talos', 09:10:55 INFO - 'log_to_console': True, 09:10:55 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 09:10:55 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 09:10:55 INFO - 'opt_config_files': (), 09:10:55 INFO - 'pip_index': False, 09:10:55 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 09:10:55 INFO - 'cmd': ('bash', 09:10:55 INFO - '-c', 09:10:55 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 09:10:55 INFO - 'enabled': True, 09:10:55 INFO - 'halt_on_failure': False, 09:10:55 INFO - 'name': 'check_screen_resolution'},), 09:10:55 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 09:10:55 INFO - 'cmd': ('bash', 09:10:55 INFO - '-c', 09:10:55 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 09:10:55 INFO - 'enabled': True, 09:10:55 INFO - 'halt_on_failure': False, 09:10:55 INFO - 'name': 'check_screen_resolution'},), 09:10:55 INFO - 'run_cmd_checks_enabled': True, 09:10:55 INFO - 'sps_profile': False, 09:10:55 INFO - 'sps_profile_interval': 0, 09:10:55 INFO - 'suite': 'dromaeojs-e10s', 09:10:55 INFO - 'system_bits': '64', 09:10:55 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:10:55 INFO - 'title': 't-yosemite-r5-0018', 09:10:55 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:10:55 INFO - 'use_talos_json': True, 09:10:55 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:10:55 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:10:55 INFO - 'work_dir': 'build'} 09:10:55 INFO - ##### 09:10:55 INFO - ##### Running clobber step. 09:10:55 INFO - ##### 09:10:55 INFO - Running pre-action listener: _resource_record_pre_action 09:10:55 INFO - Running main action method: clobber 09:10:55 INFO - rmtree: /builds/slave/test/build 09:10:55 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:10:57 INFO - Running post-action listener: _resource_record_post_action 09:10:57 INFO - ##### 09:10:57 INFO - ##### Running read-buildbot-config step. 09:10:57 INFO - ##### 09:10:57 INFO - Running pre-action listener: _resource_record_pre_action 09:10:57 INFO - Running main action method: read_buildbot_config 09:10:57 INFO - Using buildbot properties: 09:10:57 INFO - { 09:10:57 INFO - "properties": { 09:10:57 INFO - "buildnumber": 38, 09:10:57 INFO - "product": "firefox", 09:10:57 INFO - "script_repo_revision": "production", 09:10:57 INFO - "builddir": "fx-team_yosemite_test-dromaeojs-e10s", 09:10:57 INFO - "repository": "", 09:10:57 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 fx-team talos dromaeojs-e10s", 09:10:57 INFO - "buildid": "20151111072232", 09:10:57 INFO - "slavename": "t-yosemite-r5-0018", 09:10:57 INFO - "pgo_build": "False", 09:10:57 INFO - "basedir": "/builds/slave/test", 09:10:57 INFO - "project": "", 09:10:57 INFO - "platform": "yosemite", 09:10:57 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 09:10:57 INFO - "slavebuilddir": "test", 09:10:57 INFO - "scheduler": "tests-fx-team-macosx64-talos", 09:10:57 INFO - "branch": "fx-team", 09:10:57 INFO - "repo_path": "integration/fx-team", 09:10:57 INFO - "stage_platform": "macosx64", 09:10:57 INFO - "builduid": "7d0fc8b47ffa4192843cf850914bea10", 09:10:57 INFO - "revision": "db82f47b94a2aaf03968870c936452d38820bcf8" 09:10:57 INFO - }, 09:10:57 INFO - "sourcestamp": { 09:10:57 INFO - "repository": "", 09:10:57 INFO - "hasPatch": false, 09:10:57 INFO - "project": "", 09:10:57 INFO - "branch": "fx-team-macosx64-talos", 09:10:57 INFO - "changes": [ 09:10:57 INFO - { 09:10:57 INFO - "category": null, 09:10:57 INFO - "files": [ 09:10:57 INFO - { 09:10:57 INFO - "url": null, 09:10:57 INFO - "name": "https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 09:10:57 INFO - } 09:10:57 INFO - ], 09:10:57 INFO - "repository": "", 09:10:57 INFO - "rev": "db82f47b94a2aaf03968870c936452d38820bcf8", 09:10:57 INFO - "who": "cbook@mozilla.com", 09:10:57 INFO - "when": 1447260831, 09:10:57 INFO - "number": 6649112, 09:10:57 INFO - "comments": "Bug 1149245 - Make DeserializedEdgeRange re-use its referents edge vector; r=vporof", 09:10:57 INFO - "project": "", 09:10:57 INFO - "at": "Wed 11 Nov 2015 08:53:51", 09:10:57 INFO - "branch": "fx-team-macosx64-talos", 09:10:57 INFO - "revlink": "", 09:10:57 INFO - "properties": [ 09:10:57 INFO - [ 09:10:57 INFO - "buildid", 09:10:57 INFO - "20151111072232", 09:10:57 INFO - "Change" 09:10:57 INFO - ], 09:10:57 INFO - [ 09:10:57 INFO - "builduid", 09:10:57 INFO - "7d0fc8b47ffa4192843cf850914bea10", 09:10:57 INFO - "Change" 09:10:57 INFO - ], 09:10:57 INFO - [ 09:10:57 INFO - "pgo_build", 09:10:57 INFO - "False", 09:10:57 INFO - "Change" 09:10:57 INFO - ] 09:10:57 INFO - ], 09:10:57 INFO - "revision": "db82f47b94a2aaf03968870c936452d38820bcf8" 09:10:57 INFO - } 09:10:57 INFO - ], 09:10:57 INFO - "revision": "db82f47b94a2aaf03968870c936452d38820bcf8" 09:10:57 INFO - } 09:10:57 INFO - } 09:10:57 INFO - Found installer url https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 09:10:57 INFO - Running post-action listener: _resource_record_post_action 09:10:57 INFO - ##### 09:10:57 INFO - ##### Running download-and-extract step. 09:10:57 INFO - ##### 09:10:57 INFO - Running pre-action listener: _resource_record_pre_action 09:10:57 INFO - Running main action method: download_and_extract 09:10:57 INFO - mkdir: /builds/slave/test/build/tests 09:10:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:10:57 INFO - https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 09:10:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/test_packages.json 09:10:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/test_packages.json 09:10:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 09:10:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 09:10:58 INFO - Downloaded 1149 bytes. 09:10:58 INFO - Reading from file /builds/slave/test/build/test_packages.json 09:10:58 INFO - Using the following test package requirements: 09:10:58 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 09:10:58 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:10:58 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 09:10:58 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:10:58 INFO - u'jsshell-mac.zip'], 09:10:58 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:10:58 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 09:10:58 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 09:10:58 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:10:58 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 09:10:58 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:10:58 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 09:10:58 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:10:58 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 09:10:58 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 09:10:58 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 09:10:58 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 09:10:58 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 09:10: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')]} 09:10:58 INFO - https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 09:10:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:10:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:10:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/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 09:10:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/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 09:31:36 INFO - Downloaded 17454007 bytes. 09:31:36 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 09:31:36 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:31:36 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 09:31:41 INFO - Return code: 0 09:31:41 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 09:31:41 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')]} 09:31:41 INFO - https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 09:31:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:31:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:31:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/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 09:31:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/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 09:32:07 INFO - Downloaded 17454007 bytes. 09:32:07 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 09:32:07 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 09:32:07 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 09:32:12 INFO - Return code: 0 09:32: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')]} 09:32:12 INFO - https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 09:32:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 09:32:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 09:32:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/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 09:32:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/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 09:32:14 INFO - Downloaded 11131693 bytes. 09:32:14 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 09:32:14 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 09:32:14 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 09:32:15 INFO - Return code: 0 09:32:15 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')]} 09:32:15 INFO - https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 09:32:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 09:32:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 09:32:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 09:32:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SdaCC33NTd2S4BDRt9ohGQ/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 09:32:49 INFO - Downloaded 108707273 bytes. 09:32:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 09:32:49 INFO - mkdir: /builds/slave/test/properties 09:32:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:32:49 INFO - Writing to file /builds/slave/test/properties/build_url 09:32:49 INFO - Contents: 09:32:49 INFO - build_url:https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 09:32:49 INFO - Running post-action listener: _resource_record_post_action 09:32:49 INFO - Running post-action listener: set_extra_try_arguments 09:32:49 INFO - ##### 09:32:49 INFO - ##### Running populate-webroot step. 09:32:49 INFO - ##### 09:32:49 INFO - Running pre-action listener: _resource_record_pre_action 09:32:49 INFO - Running main action method: populate_webroot 09:32:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:32:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:32:49 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 09:32:49 INFO - '../fennec_ids.txt'], 09:32:49 INFO - 'tests': ['tcheck2']}, 09:32:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:32:49 INFO - '--tppagecycles', 09:32:49 INFO - '7'], 09:32:49 INFO - 'tests': ['tsvgm']}}, 09:32:49 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 09:32:49 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:32:49 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 09:32:49 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 09:32:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:32:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:49 INFO - 'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:32:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:49 INFO - 'tests': ['damp', 'tps']}, 09:32:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:49 INFO - 'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['damp', 'tps']}, 09:32:49 INFO - 'g3': {'tests': ['dromaeo_dom']}, 09:32:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:32:49 INFO - 'other': {'tests': ['a11yr', 09:32:49 INFO - 'ts_paint', 09:32:49 INFO - 'tpaint', 09:32:49 INFO - 'sessionrestore', 09:32:49 INFO - 'sessionrestore_no_auto_restore']}, 09:32:49 INFO - 'other-e10s': {'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['a11yr', 09:32:49 INFO - 'ts_paint', 09:32:49 INFO - 'tpaint', 09:32:49 INFO - 'sessionrestore', 09:32:49 INFO - 'sessionrestore_no_auto_restore']}, 09:32:49 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['a11yr', 09:32:49 INFO - 'ts_paint', 09:32:49 INFO - 'tpaint', 09:32:49 INFO - 'sessionrestore', 09:32:49 INFO - 'sessionrestore_no_auto_restore']}, 09:32:49 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['a11yr', 09:32:49 INFO - 'ts_paint', 09:32:49 INFO - 'tpaint', 09:32:49 INFO - 'sessionrestore', 09:32:49 INFO - 'sessionrestore_no_auto_restore']}, 09:32:49 INFO - 'other_l64': {'tests': ['a11yr', 09:32:49 INFO - 'ts_paint', 09:32:49 INFO - 'tpaint', 09:32:49 INFO - 'sessionrestore', 09:32:49 INFO - 'sessionrestore_no_auto_restore']}, 09:32:49 INFO - 'other_nol64': {'tests': ['a11yr', 09:32:49 INFO - 'ts_paint', 09:32:49 INFO - 'tpaint', 09:32:49 INFO - 'sessionrestore', 09:32:49 INFO - 'sessionrestore_no_auto_restore']}, 09:32:49 INFO - 'svgr': {'tests': ['tsvgx', 09:32:49 INFO - 'tsvgr_opacity', 09:32:49 INFO - 'tart', 09:32:49 INFO - 'tscrollx', 09:32:49 INFO - 'cart']}, 09:32:49 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['tsvgx', 09:32:49 INFO - 'tsvgr_opacity', 09:32:49 INFO - 'tart', 09:32:49 INFO - 'tscrollx', 09:32:49 INFO - 'cart']}, 09:32:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:49 INFO - 'tests': ['tp5o']}, 09:32:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:49 INFO - 'talos_options': ['--e10s'], 09:32:49 INFO - 'tests': ['tp5o']}, 09:32:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:49 INFO - 'talos_options': ['--xperf_path', 09:32:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:32:49 INFO - 'tests': ['tp5n']}, 09:32:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:32:49 INFO - 'talos_options': ['--e10s', 09:32:49 INFO - '--xperf_path', 09:32:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:32:49 INFO - 'tests': ['tp5n']}}, 09:32:49 INFO - 'talos.zip': {'path': '', 09:32:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:32:49 INFO - Running post-action listener: _resource_record_post_action 09:32:49 INFO - ##### 09:32:49 INFO - ##### Running create-virtualenv step. 09:32:49 INFO - ##### 09:32:49 INFO - Running pre-action listener: _resource_record_pre_action 09:32:49 INFO - Running main action method: create_virtualenv 09:32:49 INFO - Creating virtualenv /builds/slave/test/build/venv 09:32: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 09:32:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:32:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:32:49 INFO - Using real prefix '/tools/python27' 09:32:49 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:32:50 INFO - Installing distribute.............................................................................................................................................................................................done. 09:32:54 INFO - Installing pip.................done. 09:32:54 INFO - Return code: 0 09:32:54 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:32: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')]} 09:32:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32: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')]} 09:32:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x100adc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100ab9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fed12e330c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009ff9f0>, '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 0x10075fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1009f38c8>, '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.Tk61uT9sXx/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.4catTHUZol/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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 09:32: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', 'pip>=1.5'] in /builds/slave/test/build 09:32: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 pip>=1.5 09:32:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.Tk61uT9sXx/Render', 09:32:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:32:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:32:54 INFO - 'HOME': '/Users/cltbld', 09:32:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:32:54 INFO - 'LOGNAME': 'cltbld', 09:32:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:54 INFO - 'MOZ_NO_REMOTE': '1', 09:32:54 INFO - 'NO_EM_RESTART': '1', 09:32:54 INFO - 'PAGER': '/bin/cat', 09:32:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:32:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:54 INFO - 'PWD': '/builds/slave/test', 09:32:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:32:54 INFO - 'SHELL': '/bin/bash', 09:32:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.4catTHUZol/Listeners', 09:32:54 INFO - 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/', 09:32:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:32:54 INFO - 'USER': 'cltbld', 09:32:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:32:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:32:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:54 INFO - 'XPC_FLAGS': '0x0', 09:32:54 INFO - 'XPC_SERVICE_NAME': '0', 09:32:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:32:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:55 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 09:32:55 INFO - Cleaning up... 09:32:55 INFO - Return code: 0 09:32:55 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 09:32:55 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')]} 09:32:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:55 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')]} 09:32:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:55 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 0x100adc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100ab9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fed12e330c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009ff9f0>, '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 0x10075fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1009f38c8>, '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.Tk61uT9sXx/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.4catTHUZol/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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 09:32:55 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 09:32:55 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 09:32:55 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.Tk61uT9sXx/Render', 09:32:55 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:32:55 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:32:55 INFO - 'HOME': '/Users/cltbld', 09:32:55 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:32:55 INFO - 'LOGNAME': 'cltbld', 09:32:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:55 INFO - 'MOZ_NO_REMOTE': '1', 09:32:55 INFO - 'NO_EM_RESTART': '1', 09:32:55 INFO - 'PAGER': '/bin/cat', 09:32:55 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:32:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:55 INFO - 'PWD': '/builds/slave/test', 09:32:55 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:32:55 INFO - 'SHELL': '/bin/bash', 09:32:55 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.4catTHUZol/Listeners', 09:32:55 INFO - 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/', 09:32:55 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:32:55 INFO - 'USER': 'cltbld', 09:32:55 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:32:55 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:32:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:55 INFO - 'XPC_FLAGS': '0x0', 09:32:55 INFO - 'XPC_SERVICE_NAME': '0', 09:32:55 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:32:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:55 INFO - Downloading/unpacking psutil>=0.7.1 09:32:55 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 09:32:55 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 09:32:55 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 09:32:55 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 09:32:55 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 09:32:55 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 09:32:58 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 09:32:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 09:32:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:32:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:32:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:32:58 INFO - Installing collected packages: psutil 09:32:58 INFO - Running setup.py install for psutil 09:32:58 INFO - building 'psutil._psutil_osx' extension 09:32:58 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 09:32:58 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 09:32:58 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 09:32:59 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 09:32:59 INFO - building 'psutil._psutil_posix' extension 09:32:59 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 09:32:59 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 09:32:59 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 09:32:59 INFO - ^ 09:32:59 INFO - 1 warning generated. 09:32:59 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 09:32:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:32:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:32:59 INFO - Successfully installed psutil 09:32:59 INFO - Cleaning up... 09:32:59 INFO - Return code: 0 09:32:59 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 09:32:59 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')]} 09:32:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:32:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:59 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')]} 09:32:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:32:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:32:59 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 0x100adc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100ab9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fed12e330c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009ff9f0>, '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 0x10075fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1009f38c8>, '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.Tk61uT9sXx/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.4catTHUZol/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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 09:32:59 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 09:32:59 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 09:32:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.Tk61uT9sXx/Render', 09:32:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:32:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:32:59 INFO - 'HOME': '/Users/cltbld', 09:32:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:32:59 INFO - 'LOGNAME': 'cltbld', 09:32:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:32:59 INFO - 'MOZ_NO_REMOTE': '1', 09:32:59 INFO - 'NO_EM_RESTART': '1', 09:32:59 INFO - 'PAGER': '/bin/cat', 09:32:59 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:32:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:32:59 INFO - 'PWD': '/builds/slave/test', 09:32:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:32:59 INFO - 'SHELL': '/bin/bash', 09:32:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.4catTHUZol/Listeners', 09:32:59 INFO - 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/', 09:32:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:32:59 INFO - 'USER': 'cltbld', 09:32:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:32:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:32:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:32:59 INFO - 'XPC_FLAGS': '0x0', 09:32:59 INFO - 'XPC_SERVICE_NAME': '0', 09:32:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:32:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:32:59 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 09:32:59 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 09:32:59 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 09:32:59 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 09:32:59 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 09:32:59 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 09:32:59 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 09:33:02 INFO - Downloading mozsystemmonitor-0.0.tar.gz 09:33:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 09:33:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:33:02 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 09:33:02 INFO - Installing collected packages: mozsystemmonitor 09:33:02 INFO - Running setup.py install for mozsystemmonitor 09:33:02 INFO - Successfully installed mozsystemmonitor 09:33:02 INFO - Cleaning up... 09:33:02 INFO - Return code: 0 09:33:02 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:33:02 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')]} 09:33:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:02 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')]} 09:33:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:02 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 0x100adc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100ab9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fed12e330c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009ff9f0>, '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 0x10075fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1009f38c8>, '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.Tk61uT9sXx/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.4catTHUZol/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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 09:33:02 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 09:33:02 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 09:33:02 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.Tk61uT9sXx/Render', 09:33:02 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:33:02 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:33:02 INFO - 'HOME': '/Users/cltbld', 09:33:02 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:33:02 INFO - 'LOGNAME': 'cltbld', 09:33:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:02 INFO - 'MOZ_NO_REMOTE': '1', 09:33:02 INFO - 'NO_EM_RESTART': '1', 09:33:02 INFO - 'PAGER': '/bin/cat', 09:33:02 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:33:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:02 INFO - 'PWD': '/builds/slave/test', 09:33:02 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:33:02 INFO - 'SHELL': '/bin/bash', 09:33:02 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.4catTHUZol/Listeners', 09:33:02 INFO - 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/', 09:33:02 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:33:02 INFO - 'USER': 'cltbld', 09:33:02 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:33:02 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:33:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:02 INFO - 'XPC_FLAGS': '0x0', 09:33:02 INFO - 'XPC_SERVICE_NAME': '0', 09:33:02 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:33:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:03 INFO - Downloading/unpacking blobuploader==1.2.4 09:33:03 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 09:33:03 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 09:33:03 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 09:33:03 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 09:33:03 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 09:33:03 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 09:33:05 INFO - Downloading blobuploader-1.2.4.tar.gz 09:33:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 09:33:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:33:05 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:33: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 09:33: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 09:33: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 09:33: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 09:33: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 09:33: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 09:33:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 09:33:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:33:06 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:33:06 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 09:33:06 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 09:33:06 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 09:33:06 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 09:33:06 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 09:33:06 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 09:33:06 INFO - Downloading docopt-0.6.1.tar.gz 09:33:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 09:33:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:33:07 INFO - Installing collected packages: blobuploader, requests, docopt 09:33:07 INFO - Running setup.py install for blobuploader 09:33:07 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:33:07 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:33:07 INFO - Running setup.py install for requests 09:33:07 INFO - Running setup.py install for docopt 09:33:08 INFO - Successfully installed blobuploader requests docopt 09:33:08 INFO - Cleaning up... 09:33:08 INFO - Return code: 0 09:33:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:33:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:33:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:33:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:08 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 0x100adc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100ab9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fed12e330c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009ff9f0>, '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 0x10075fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1009f38c8>, '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.Tk61uT9sXx/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.4catTHUZol/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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 09:33:08 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 09:33:08 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 09:33:08 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.Tk61uT9sXx/Render', 09:33:08 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:33:08 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:33:08 INFO - 'HOME': '/Users/cltbld', 09:33:08 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:33:08 INFO - 'LOGNAME': 'cltbld', 09:33:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:08 INFO - 'MOZ_NO_REMOTE': '1', 09:33:08 INFO - 'NO_EM_RESTART': '1', 09:33:08 INFO - 'PAGER': '/bin/cat', 09:33:08 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:33:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:08 INFO - 'PWD': '/builds/slave/test', 09:33:08 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:33:08 INFO - 'SHELL': '/bin/bash', 09:33:08 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.4catTHUZol/Listeners', 09:33:08 INFO - 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/', 09:33:08 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:33:08 INFO - 'USER': 'cltbld', 09:33:08 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:33:08 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:33:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:08 INFO - 'XPC_FLAGS': '0x0', 09:33:08 INFO - 'XPC_SERVICE_NAME': '0', 09:33:08 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:33:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:33:08 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-XirReQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:33:08 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-HLYkWl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:33:08 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-DRhbmB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:33:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:33:08 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-alRhSy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:33:09 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-bzTYjA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:33:09 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-pJkzx6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:33:09 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-06Qk_7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:33:09 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-Iuwlq1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:33:09 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-qrYzKr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:33:09 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-W3xsKv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:33:09 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-EyJ2u1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:33:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:33:09 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-_iOgdW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:33:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:33:10 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-kysU2Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:33:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:33:10 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-2SqOf9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:33:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:33:10 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-7e7mmw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:33:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:33:10 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-yWF_eM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:33:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:33:10 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-_sm3ig-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:33:10 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:33:10 INFO - Running setup.py install for manifestparser 09:33:10 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:33:10 INFO - Running setup.py install for mozcrash 09:33:11 INFO - Running setup.py install for mozdebug 09:33:11 INFO - Running setup.py install for mozdevice 09:33:11 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:33:11 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:33:11 INFO - Running setup.py install for mozfile 09:33:11 INFO - Running setup.py install for mozhttpd 09:33:11 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:33:11 INFO - Running setup.py install for mozinfo 09:33:11 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:33:12 INFO - Running setup.py install for mozInstall 09:33:12 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:33:12 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:33:12 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:33:12 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:33:12 INFO - Running setup.py install for mozleak 09:33:12 INFO - Running setup.py install for mozlog 09:33:12 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:33:12 INFO - Running setup.py install for moznetwork 09:33:12 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:33:12 INFO - Running setup.py install for mozprocess 09:33:12 INFO - Running setup.py install for mozprofile 09:33:13 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:33:13 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:33:13 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:33:13 INFO - Running setup.py install for mozrunner 09:33:13 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:33:13 INFO - Running setup.py install for mozscreenshot 09:33:13 INFO - Running setup.py install for moztest 09:33:13 INFO - Running setup.py install for mozversion 09:33:13 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:33:13 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:33:13 INFO - Cleaning up... 09:33:13 INFO - Return code: 0 09:33:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:33:13 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')]} 09:33:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:13 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')]} 09:33:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:13 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 0x100adc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100ab9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fed12e330c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009ff9f0>, '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 0x10075fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1009f38c8>, '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.Tk61uT9sXx/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.4catTHUZol/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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 09:33:13 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 09:33:13 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 09:33:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.Tk61uT9sXx/Render', 09:33:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:33:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:33:13 INFO - 'HOME': '/Users/cltbld', 09:33:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:33:13 INFO - 'LOGNAME': 'cltbld', 09:33:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:13 INFO - 'MOZ_NO_REMOTE': '1', 09:33:13 INFO - 'NO_EM_RESTART': '1', 09:33:13 INFO - 'PAGER': '/bin/cat', 09:33:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:33:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:13 INFO - 'PWD': '/builds/slave/test', 09:33:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:33:13 INFO - 'SHELL': '/bin/bash', 09:33:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.4catTHUZol/Listeners', 09:33:13 INFO - 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/', 09:33:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:33:13 INFO - 'USER': 'cltbld', 09:33:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:33:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:33:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:13 INFO - 'XPC_FLAGS': '0x0', 09:33:13 INFO - 'XPC_SERVICE_NAME': '0', 09:33:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:33:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:33:14 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-mO6HiM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:33:14 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)) 09:33:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:33:14 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-gp5G70-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:33:14 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)) 09:33:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:33:14 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-hYl0p0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:33:14 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)) 09:33:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:33:14 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-WJaSI6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:33:14 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)) 09:33:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:33:14 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-2uYeKl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:33:14 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)) 09:33:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:33:14 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-MyBy4K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:33:15 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)) 09:33:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:33:15 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-LKoTy7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:33:15 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)) 09:33:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:33:15 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-YV0gyX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:33:15 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)) 09:33:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:33:15 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-cafO41-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:33:15 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)) 09:33:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:33:15 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-ZVS1_P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:33:15 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)) 09:33:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:33:15 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-Jl1i8B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:33:15 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)) 09:33:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:33:15 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-xHfn67-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:33:15 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)) 09:33:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:33:15 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-UkS1KB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:33:16 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)) 09:33:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:33:16 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-6amT9D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:33:16 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)) 09:33:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:33:16 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-oxEywV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:33:16 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)) 09:33:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:33:16 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-yrI9bl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:33:16 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)) 09:33:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:33:16 INFO - Running setup.py (path:/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/pip-3lExMk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:33:16 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)) 09:33:16 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)) 09:33:16 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)) 09:33:16 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)) 09:33:16 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)) 09:33:16 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)) 09:33:16 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:33:16 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 09:33:16 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 09:33:16 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 09:33:16 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 09:33:16 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 09:33:16 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 09:33:19 INFO - Downloading blessings-1.5.1.tar.gz 09:33:19 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 09:33:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:33:19 INFO - Installing collected packages: blessings 09:33:19 INFO - Running setup.py install for blessings 09:33:19 INFO - Successfully installed blessings 09:33:19 INFO - Cleaning up... 09:33:19 INFO - Return code: 0 09:33:19 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:33:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:33:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:33:19 INFO - Reading from file tmpfile_stdout 09:33:19 INFO - Current package versions: 09:33:19 INFO - blessings == 1.5.1 09:33:19 INFO - blobuploader == 1.2.4 09:33:19 INFO - docopt == 0.6.1 09:33:19 INFO - manifestparser == 1.1 09:33:19 INFO - mozInstall == 1.12 09:33:19 INFO - mozcrash == 0.16 09:33:19 INFO - mozdebug == 0.1 09:33:19 INFO - mozdevice == 0.47 09:33:19 INFO - mozfile == 1.2 09:33:19 INFO - mozhttpd == 0.7 09:33:19 INFO - mozinfo == 0.9 09:33:19 INFO - mozleak == 0.1 09:33:19 INFO - mozlog == 3.0 09:33:19 INFO - moznetwork == 0.27 09:33:19 INFO - mozprocess == 0.22 09:33:19 INFO - mozprofile == 0.27 09:33:19 INFO - mozrunner == 6.11 09:33:19 INFO - mozscreenshot == 0.1 09:33:19 INFO - mozsystemmonitor == 0.0 09:33:19 INFO - moztest == 0.7 09:33:19 INFO - mozversion == 1.4 09:33:19 INFO - psutil == 3.1.1 09:33:19 INFO - requests == 1.2.3 09:33:19 INFO - wsgiref == 0.1.2 09:33:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:33:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:33:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:33:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-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 0x100adc490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100ab9228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fed12e330c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1009ff9f0>, '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 0x10075fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1009f38c8>, '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.Tk61uT9sXx/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.4catTHUZol/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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 09:33:19 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 09:33:19 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 09:33:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.Tk61uT9sXx/Render', 09:33:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:33:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:33:19 INFO - 'HOME': '/Users/cltbld', 09:33:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:33:19 INFO - 'LOGNAME': 'cltbld', 09:33:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:19 INFO - 'MOZ_NO_REMOTE': '1', 09:33:19 INFO - 'NO_EM_RESTART': '1', 09:33:19 INFO - 'PAGER': '/bin/cat', 09:33:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:33:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:19 INFO - 'PWD': '/builds/slave/test', 09:33:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:33:19 INFO - 'SHELL': '/bin/bash', 09:33:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.4catTHUZol/Listeners', 09:33:19 INFO - 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/', 09:33:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:33:19 INFO - 'USER': 'cltbld', 09:33:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:33:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:33:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:19 INFO - 'XPC_FLAGS': '0x0', 09:33:19 INFO - 'XPC_SERVICE_NAME': '0', 09:33:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:33:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 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)) 09:33:20 INFO - Cleaning up... 09:33:20 INFO - Return code: 0 09:33:20 INFO - Running post-action listener: _resource_record_post_action 09:33:20 INFO - Running post-action listener: _start_resource_monitoring 09:33:20 INFO - Starting resource monitoring. 09:33:20 INFO - ##### 09:33:20 INFO - ##### Running install step. 09:33:20 INFO - ##### 09:33:20 INFO - Running pre-action listener: _resource_record_pre_action 09:33:20 INFO - Running main action method: install 09:33:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:33:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:33:20 INFO - Reading from file tmpfile_stdout 09:33:20 INFO - Detecting whether we're running mozinstall >=1.0... 09:33:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:33:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:33:20 INFO - Reading from file tmpfile_stdout 09:33:20 INFO - Output received: 09:33:20 INFO - Usage: mozinstall [options] installer 09:33:20 INFO - Options: 09:33:20 INFO - -h, --help show this help message and exit 09:33:20 INFO - -d DEST, --destination=DEST 09:33:20 INFO - Directory to install application into. [default: 09:33:20 INFO - "/builds/slave/test"] 09:33:20 INFO - --app=APP Application being installed. [default: firefox] 09:33:20 INFO - mkdir: /builds/slave/test/build/application 09:33:20 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'] 09:33:20 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 09:34:01 INFO - Reading from file tmpfile_stdout 09:34:01 INFO - Output received: 09:34:01 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 09:34:01 INFO - Running post-action listener: _resource_record_post_action 09:34:01 INFO - ##### 09:34:01 INFO - ##### Running run-tests step. 09:34:01 INFO - ##### 09:34:01 INFO - Running pre-action listener: _resource_record_pre_action 09:34:01 INFO - Running main action method: run_tests 09:34:01 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 09:34:01 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 09:34:01 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 09:34:01 INFO - 2015-11-11 09:34:01.061 screenresolution[2200:17662] starting screenresolution argv=screenresolution get 09:34:01 INFO - 2015-11-11 09:34:01.065 screenresolution[2200:17662] Display 0: 1600x1200x32@60 09:34:01 INFO - 2015-11-11 09:34:01.072 screenresolution[2201:17664] starting screenresolution argv=screenresolution list 09:34:01 INFO - Available Modes on Display 0 09:34:01 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 09:34:01 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 09:34:01 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 09:34:01 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 09:34:01 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 09:34:01 INFO - Intel HD Graphics 3000: 09:34:01 INFO - Chipset Model: Intel HD Graphics 3000 09:34:01 INFO - Type: GPU 09:34:01 INFO - Bus: Built-In 09:34:01 INFO - VRAM (Total): 512 MB 09:34:01 INFO - VRAM (Dynamic, Max): 10 09:34:01 INFO - Vendor: Intel (0x8086) 09:34:01 INFO - Device ID: 0x0116 09:34:01 INFO - Revision ID: 0x0009 09:34:01 INFO - Displays: 09:34:01 INFO - Display: 09:34:01 INFO - Resolution: 1600 x 1200 @ 60 Hz 09:34:01 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 09:34:01 INFO - Display Serial Number: 1600x1200 60 09:34:01 INFO - Main Display: Yes 09:34:01 INFO - Mirror: Off 09:34:01 INFO - Online: Yes 09:34:01 INFO - Rotation: Supported 09:34:01 INFO - Return code: 0 09:34:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:34:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:34:01 INFO - Python 2.7.3 09:34:01 INFO - Return code: 0 09:34:01 INFO - grabbing minidump binary from tooltool 09:34: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')]} 09:34:01 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 0x1009ff9f0>, '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 0x10075fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1009f38c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:34:01 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 09:34:01 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 09:34:01 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:34:01 INFO - Return code: 0 09:34:01 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 09:34:01 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:34:01 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:34:01 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 09:34:01 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:34:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0018', '--webServer', 'localhost'] in /builds/slave/test/build 09:34:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0018 --webServer localhost 09:34:01 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.Tk61uT9sXx/Render', 09:34:01 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 09:34:01 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 09:34:01 INFO - 'HOME': '/Users/cltbld', 09:34:01 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 09:34:01 INFO - 'LOGNAME': 'cltbld', 09:34:01 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:34:01 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 09:34:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:34:01 INFO - 'MOZ_NO_REMOTE': '1', 09:34:01 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:34:01 INFO - 'NO_EM_RESTART': '1', 09:34:01 INFO - 'PAGER': '/bin/cat', 09:34:01 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 09:34:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:34:01 INFO - 'PWD': '/builds/slave/test', 09:34:01 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:34:01 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 09:34:01 INFO - 'SHELL': '/bin/bash', 09:34:01 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.4catTHUZol/Listeners', 09:34:01 INFO - 'TMPDIR': '/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/', 09:34:01 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 09:34:01 INFO - 'USER': 'cltbld', 09:34:01 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 09:34:01 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 09:34:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:34:01 INFO - 'XPC_FLAGS': '0x0', 09:34:01 INFO - 'XPC_SERVICE_NAME': '0', 09:34:01 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 09:34:01 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0018', '--webServer', 'localhost'] with output_timeout 3600 09:34:01 INFO - mozversion INFO | application_buildid: 20151111072232 09:34:01 INFO - mozversion INFO | application_changeset: db82f47b94a2aaf03968870c936452d38820bcf8 09:34:01 INFO - mozversion INFO | application_display_name: Nightly 09:34:01 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:34:01 INFO - mozversion INFO | application_name: Firefox 09:34:01 INFO - mozversion INFO | application_remotingname: firefox 09:34:01 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 09:34:01 INFO - mozversion INFO | application_vendor: Mozilla 09:34:01 INFO - mozversion INFO | application_version: 45.0a1 09:34:01 INFO - mozversion INFO | platform_buildid: 20151111072232 09:34:01 INFO - mozversion INFO | platform_changeset: db82f47b94a2aaf03968870c936452d38820bcf8 09:34:01 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 09:34:01 INFO - mozversion INFO | platform_version: 45.0a1 09:34:01 INFO - 2015-11-11 09:34:01,719 DEBUG : using testdate: 1447263241 09:34:01 INFO - 2015-11-11 09:34:01,719 DEBUG : actual date: 1447263241 09:34:01 INFO - 2015-11-11 09:34:01,729 INFO : starting webserver on 'localhost:50896' 09:34:01 INFO - 2015-11-11 09:34:01,730 INFO : Starting test suite t-yosemite-r5-0018.e 09:34:01 INFO - 2015-11-11 09:34:01,730 INFO : Starting test dromaeo_css 09:34:01 INFO - 2015-11-11 09:34:01,730 DEBUG : operating with platform_type : mac_ 09:34:01 INFO - 2015-11-11 09:34:01,731 INFO : Initialising browser for dromaeo_css test... 09:34:01 INFO - 2015-11-11 09:34:01,765 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/tmpe_BDLt/profile http://localhost:50896/getInfo.html 09:34:05 INFO - 2015-11-11 09:34:05,654 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:34:05 INFO - 2015-11-11 09:34:05,654 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:34:05 INFO - 2015-11-11 09:34:05,654 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 09:34:05 INFO - 2015-11-11 09:34:05,654 DEBUG : BROWSER_OUTPUT: __metrics 09:34:06 INFO - 2015-11-11 09:34:06,344 INFO : Browser initialized. 09:34:06 INFO - 2015-11-11 09:34:06,345 INFO : Running cycle 1/1 for dromaeo_css test... 09:34:06 INFO - 2015-11-11 09:34:06,345 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/tmpe_BDLt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:34:18 INFO - 2015-11-11 09:34:18,694 DEBUG : BROWSER_OUTPUT: RSS: Main: 240451584 09:34:18 INFO - 2015-11-11 09:34:18,694 DEBUG : BROWSER_OUTPUT: 09:35:08 INFO - 2015-11-11 09:35:08,542 DEBUG : BROWSER_OUTPUT: 1447263308536 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] 09:37:20 INFO - 2015-11-11 09:37:20,092 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50896/tests/dromaeo/cssquery-ext.html) 09:37:21 INFO - 2015-11-11 09:37:21,299 DEBUG : BROWSER_OUTPUT: RSS: Main: 264413184 09:37:21 INFO - 2015-11-11 09:37:21,299 DEBUG : BROWSER_OUTPUT: 09:40:23 INFO - 2015-11-11 09:40:23,294 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/dromaeo/cssquery-ext.html (next: http://localhost:50896/tests/dromaeo/cssquery-jquery.html) 09:40:23 INFO - 2015-11-11 09:40:23,883 DEBUG : BROWSER_OUTPUT: RSS: Main: 270602240 09:40:23 INFO - 2015-11-11 09:40:23,883 DEBUG : BROWSER_OUTPUT: 09:43:25 INFO - 2015-11-11 09:43:25,623 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50896/tests/dromaeo/cssquery-mootools.html) 09:43:26 INFO - 2015-11-11 09:43:26,228 DEBUG : BROWSER_OUTPUT: RSS: Main: 274616320 09:43:26 INFO - 2015-11-11 09:43:26,228 DEBUG : BROWSER_OUTPUT: 09:46:27 INFO - 2015-11-11 09:46:27,992 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50896/tests/dromaeo/cssquery-prototype.html) 09:46:28 INFO - 2015-11-11 09:46:28,580 DEBUG : BROWSER_OUTPUT: RSS: Main: 279511040 09:46:28 INFO - 2015-11-11 09:46:28,580 DEBUG : BROWSER_OUTPUT: 09:49:31 INFO - 2015-11-11 09:49:31,286 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50896/tests/dromaeo/cssquery-yui.html) 09:49:31 INFO - 2015-11-11 09:49:31,905 DEBUG : BROWSER_OUTPUT: RSS: Main: 283119616 09:49:31 INFO - 2015-11-11 09:49:31,906 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,090 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/dromaeo/cssquery-yui.html (next: http://localhost:50896/tests/dromaeo/cssquery-dojo.html) 09:52:34 INFO - 2015-11-11 09:52:34,341 DEBUG : BROWSER_OUTPUT: RSS: Main: 287997952 09:52:34 INFO - 2015-11-11 09:52:34,341 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,342 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:52:34 INFO - 2015-11-11 09:52:34,342 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:52:34 INFO - 2015-11-11 09:52:34,343 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:52:34 INFO - 2015-11-11 09:52:34,343 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:52:34 INFO - 2015-11-11 09:52:34,344 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2730.440259746752;2780.81924674896;2802.075315146002;2843.1470558832343;2903.4773740726687;4819.638527110467;4872.196087645534;4908.04293162833;4930.7534623268875;4976.925346119811;4680.1107789519965;4796.064767370364;4796.208625576775;4823.107725070856;4827.589654879331;4441.022974945515;4486.506484286726;4491.977540112295;4583.862484125465;4622.537746225385;4440.933385999213;4475.530069342721;4508.458984921814;4512.345709872066;4567.4062371891605;4459.264221403465;4465.598096171344;4535.455745310567;4540.091981603676;4556.794944227518;4267.91464170718;4388.692791504596;4455;4526.864194074183;4548.363229147922;4457.1977044132045;4481.215787237221;4492.124035813018;4530.365748795171;4546.113507865967;4694.953050469486;4731.4795372509;4868.488808675073;4886.071646387175;4891.535304146136;5101.744912754384;5173.81891633791;5187.948120518784;5197.454267301954;5209.739513024371;5215.16557350822;5222.399424066205;5231;5252.65857719247;5287.841364759063;4666.230072038144;4791.832285870048;4873.951260487421;4900.705957642553;4918.778654960535;5243.764030618631;5300.655457395257;5341.519263266325;5359.142537194109;5405.918911216335;5176.7411629418375;5184.040952423814;5198.636095473281;5199.818006369835;5254.6847189168775;5076.111680455905;5089.440161582223;5180;5256.710880901587;5316.521513063843;5109.923351149736;5168.2764412982215;5168.61235407346;5185;5198.92201616976;5184.688918664892;5190.922136167885;5193;5197.480251974848;5216.530512253839;3932.095618007817;3984.7210695251633;4014.9598504014584;4064.2684316822665;4081.1837632473625;3644.4533320001683;3666.651668091527;3676.4669122977552;3706.184639379332;3723.422869455239;4940.876478088005;4966.627502937295;4968.826091086795;4974.427940786783;5037.773300201499;5067.214581739836;5190.6107041971245;5192.221166825007;5275;5301.761420735999;4952.331435256267;4971.577415919687;4994.700317980933;4995.100881841304;5066.392032956069;4436.7559784211535;4608.28571571407;4640.489546149921;4660.883477913079;4675.57919787214;5302.151655735064;5329.706866122323;5381.11211650089;5397.217403476396;5436.483534064258;5276.973615131899;5295.549878260391;5296.443873393392;5302.522772950453;5345.75944082525;5183.352080989876;5318.4149743527405;5423.050966080999;5438.075527160313;5459.590530710133;5081.822136225214;5125.641205115606;5130.769115389742;5147.6654017488745;5189.766460509361;5263.184206448007;5272.525472707474;5279.89440211186;5302.125149350314;5324.334458192726;4925.729084900365;4973.825916092919;5097.133487307093;5133.512316329943;5187.04039752647;5114.5652619527755;5121.948780512147;5122.692638441706;5154.433012368711;5187.792488300426;4900.191468407673;4999.0251900878975;5021.7740201690285;5028.094942910311;5074.441811400669;4923.778429970588;5001.924971125363;5028.321176641107;5118.129917913889;5122.615803814803;4931.309616653743;5021.548060674557;5036.143855544493;5046.9747651261505;5055.5955523557295 09:52:34 INFO - 2015-11-11 09:52:34,347 DEBUG : BROWSER_OUTPUT: |1;ext.html;475.0783480048705;476.05740633545577;479.2332268370607;489.6425609305206;518.1062666899596;32720.836395818016;33545.99999999994;33600.98394096356;33719.831400842995;33897;36167.63832361675;36692;36780.63219367806;36791.63208367916;37037.25925481489;8028.879566806488;8095.838083238332;8151.266386025257;8188.54962977036;8194.30348420382;7880.64537095832;8031.03627564693;8041.477303975252;8047.315978141835;8071.475354101994;7954.920450795505;8053.1141574426765;8063.516189028648;8079.9192008080045;8141.307988820958;8023.4383593148505;8082.19178082193;8122.350211983056;8128.105908350077;8151.673933042671;7829.725959591444;7972.162922893129;7979.162187970238;7991.680332786682;8018.67925282988;33790.49314260288;34163.658363416296;34190.658093419;34235;34277;2650.973490265092;3052.6642069372574;3109.782315237934;3123.5314702794535;3136.6549679535233;23555.411114722097;23931.40171495709;23931.52136957251;24115.155969541156;24641.507169856683;1918.3189967561455;2007.979920200794;2008.2469074097214;2012.7785943546198;2092.529180934293;242202.7889860557;243091;244242;246051;246425;46193.5380646196;48187;51977;52310.21534676983;54189.45810541923;52834;53139.734301328244;53295.73352133214;53666.46333536693;54049.459505405226;13355.198688078746;13504.257265850472;13521.121127126706;13556.186628802303;13584.524541641193;10251;10271.640492582725;10274.075333220046;10292.948535257425;10304.278700490893;17357.3057077718;17499.475015749547;17567.472975810746;17611.911940440474;17655.470335889942;7368.447366447538;7581.279778421042;7611.619419029026;7613.401185750943;7701.653425595861;780.6135962698387;845.7758693946109;852.6887685994567;891.7191084808394;1013.6452241715341;24761.62857557138;25013.749862501143;25018.12436564748;25034.499310013696;25136.24591262265;921.613022272318;962.9855552166723;1004.7839714461426;1034.4310629154086;1038.0190719769896;12843.550475733304;12950.805737913939;12987.545435909888;13049.673758156123;13125.212487250796;253311;255242;256114;258068;258992;46983.76508117437;47057.76471117623;47144.05711885743;47272.290915636295;47456;1201.0271679939276;1206.5735398621498;1214.9453274602488;1218.1899037140379;1222.10175520992;24180.637290440307;24873.502529949663;24930.501389971738;24986.875065624554;25000.499989999735;40127.1974560513;40305.1938961225;40335.3949690749;40402.39396409115;40838.387424189255;241061;242808;244087;244552;245515;28004.43991120207;36407.271854562234;38239.23521529498;38332.23335533218;38355;36255.63744362522;36873.63126368702;37098.62901370952;37504.81247593745;37587.248255035294;29744.702552974195;31263.374732505676;31596.842015789774;31597.8420107898;31598.526022110145;30620.540691889193;30878;30916.381672366875;30937.535936961413;30948.0715578533;34285.48571771475;34435.311293773484;34650.65349346474;34914;34917.825410872785;29655.85172074126;32188.356232875678;32483.35033299368;32750.34499310048;35083.64916350804;26473.205803825917;26498.867505662347;26713.866430667724;26925.865370673022;27013.45973080488 09:52:34 INFO - 2015-11-11 09:52:34,349 DEBUG : BROWSER_OUTPUT: |2;jquery.html;291.8715765063371;297.89275860690145;298.95067313893225;300.60020173169687;307.1231633685826;10096.192304615632;10556.472176391188;15218.847811521882;15401.075935443867;15755.291011904463;9892.15916647086;10076.596936122565;10237.641682541112;10346.275760696753;10376.169906407487;3835.923281534375;3933.6656384207377;3939.2712348215528;3940.0937784309626;3943.507061617298;3797.3734333835023;3868.825902834365;3915.725899187058;3917.3536366499493;3971.126352202511;2902.680705122435;3025.909222723322;3849.0377405648587;3863.420486926955;4075.4498142750645;4144.502659680843;4152.024274295538;4167.999680076759;4172.061286210594;4182.498100227992;3447.517347571342;3530.735194860396;3540.6459354064646;3540.6636369544854;3552.342816578941;11264.098872090213;11295.887041129567;11540.192186546945;11565.826512602318;11568.132390070778;1565.1157096240702;1575.952721418348;1655.8178600353951;1672.6320209553878;1792.9551761205944;8236.217559331913;8247.422680412374;8255.504669719836;8484.78788030298;8490.830183396298;1354.3093022558467;1392.2481859795698;1393.7491251574713;1400.2858542143479;1408.4859026455372;45671.77164114158;45715.085698285846;46098.308525372144;46926;47377.28934066026;5549.528290095387;5642.153676948408;5703.600747947687;5740.339860915965;5762.683052432073;6380;6441.420272175526;6461.870762584722;6468.5472016958365;6471.579347342407;4642.3500709900645;4682.648801339913;4701.976490117528;4720.33915251865;4733.810647574059;4954.9752251238515;4961.404631444249;4971.975140124277;5003.699778013331;5017.774200161001;2508.7992960563474;2529.127451029392;2534.5817940040056;2551.2983929419556;2552.1322750265;905.9365844390829;908.8318661047728;909.0727457992942;924.699472671371;964.8022155458115;360.423322683704;361.3766253213239;375.167128973678;383.0290214306719;395.11888488669854;8664.783380415414;9801.411915285105;10063.64777232808;10154.492275386201;10228.846567301496;381.4564245949511;396.9047428617111;400.3054700095332;400.5733893403516;415.86692258476995;5283.6037297202865;5361.115415956401;5362.946370536322;5420.430854760193;5425.403205647375;444246;446644;455751;455998;457213;60789.392106079256;61043;61518;62238;62652;430.1053808079188;435.27743945051066;436.3694461503097;437.40512902453276;441.5562359828416;9634.759131021781;9699.854502182614;9740.149371619369;9831.459269740233;9909.058639429242;29886.551701724926;30222;30229.848850755607;30798.230044249074;30934.69065309318;39595.2080958385;40157.79921100376;40192.39711404273;40419.3937090938;40452.19095618012;5284.550813180923;5312.309399778004;5414.35027796667;5415.783368665367;5418.810341638024;9936.652217172654;9994.10053095225;10153.664657128755;10242.078212960869;10249.9487502562;8671.4363566368;8831.779205519913;8921.15249051339;8923.553822308728;8983.910160898307;8200.179982001751;8524.147585241426;8530.061693213866;8577.270931970852;8814.471131732116;8767.298616110824;8916.28669706435;9008.954955225181;9047.276217902421;9109.271258299452;5324.600654950972;5362.195670649277;5393.1370980642905;5402.216678581663;5406.810761623325;8805.603747831492;8884.689035883714;8931.821363572823;9030.45817250967;9050.778144950611 09:52:34 INFO - 2015-11-11 09:52:34,353 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1449.8767604753596;1514.3488300030986;1548.914809685467;1562.4921900382378;1565.5068653374187;6337.588056776306;6472;6985.511014229006;7249.637518124086;7256.5283256588355;6718.865622687544;6804.421624161952;6915.204751453584;6925.995730619057;6949.131358580177;1938.6801177805646;1976.2490253703572;1978.0307649251836;1979.0203849094646;1996.951600409782;1964.0572525187918;2003.7996200379991;2008.849336299776;2008.9397318080407;2014.1943222710959;1945.046927005764;1948.1136083082163;1969.803019698033;1971.142552989447;1973.1022384814876;1938.4766113149442;1951.2975328881591;1952.2386269354963;1963;1986.384220891521;1930.6428310762412;1938.0697265312588;1954.6383918975034;1991.1338567723087;1993.5614164883702;7000.054992575988;7073.646317684147;7078.858422831566;7089.468289878279;7119.857602847914;4217.725847819882;4281.828726850922;4292.527821939584;4297.226499230137;4300.6344460720875;2137.10241698487;2194.9561008779733;2395.8921848516857;2491.2277194069898;2491.7383674714256;718.2888939949412;718.9209186989427;739.8187444076182;752.9661165247577;762.4434163060942;9347.112024357742;9436.197923176469;9470.810583788285;9493.05069493052;9529.142377186017;3798.1833905710405;3819.1597848473293;3896.2402331545077;3912.941305880414;3917.6474117329576;8161.959190204129;8179.509229446252;8194.139615340304;8208.671653133928;8216.548089854996;4328.242557552416;4335.436393268855;4338.414314067623;4341.0449701066345;4380.123975204971;3895.5909629488497;3920.4903362563255;3924.0778417071965;3928.5874983126932;3929.6659783918117;3246.62663793662;3333.5999680038067;3371.292028673957;3373.797572145679;3379.7803142795638;1068.6046162919613;1097.3744965369822;1097.8627671541058;1098.6813823991113;1101.7245688577855;909.1817364371985;949.2975198353168;1162.1342100135453;1175.8236264560385;1179.5576658752968;6566.343365663395;6658.866822663616;6671.032700258435;6718.865622687616;6724.966375168093;933.3979583168954;950.5912457643279;953.8950715421298;1011.6155860773007;1034.1726618705006;5179.870503237449;5196.194589838581;5220.190870415092;5234.162533994542;5240.68555886648;7643.847123057508;7973.9202607973175;8219.589020548949;8435.704750333709;8477.618507167192;8249.917500824915;8299.751007469786;8331.791705207419;8362.498250105013;8382.832343353099;6468.417842394207;6612.206535215805;6641.667916604247;6643.933560664332;6708.563943343667;6535.150430444012;6536.379043990813;6540.280569137296;6542.443892269211;6573.704183311666;7294.671739771617;7367.521111127974;7401.7039318428815;7421;7438.330550250504;7502.249775022454;7568.356689681439;7720.806979825549;7734.381249499914;7740.380769538311;5813.651180928989;5898.587098903035;5913.793017244376;5922.200502932222;5925.229720136354;6654.667266636746;6763.391294783493;6778.627175505395;6791.117154769849;6828.351306625863;6255.218097737783;6309.873802523832;6368.490520758421;6394.008928616072;6421.935780642134;6142.815715528542;6221.96889015552;6256.812295631138;6277.403646653561;6283.434490895841;6197.194364732736;6305.5270854687;6351.3331100235655;6354.17395738551;6367.936320636734;5765.827025189251;5779.653220806765;5786.710664466844;5798.82603521895;5822.82531524055;5824.359320474659;5840.890230856124;5869.295684517885;5873.853153671193;5899.144624029406 09:52:34 INFO - 2015-11-11 09:52:34,353 DEBUG : BROWSER_OUTPUT: |4;prototype.html;268.44833866404554;276.98485052283377;281.3570990287193;284.0894931743762;288.80505658680386;5167.922481162776;5325.573954083674;5434.375046869611;5441.619086663935;5466.125419932811;5303.204519322104;5382.461753824616;5395.59533035022;5408.810691625794;5415.377231618365;4129.318662420697;4135.627793498585;4137.8965525861795;4138.213739389514;4163.292240319138;4102.3436250199975;4121.423000779893;4121.732087414309;4140.399642051916;4176.7076304658685;4094.2016306820183;4098.877033688994;4156.875293741193;4157.8544750933725;4159.355299928516;3985.20295940813;4052.331365324718;4058.147788964321;4067.5932406759384;4130.793460326971;3464.9826750866087;3476.9304613907834;3479.1476088358513;3484.372812893678;3493.4410494320787;5211.166213405875;5228.2680424740565;5230.241614965847;5235.345581802275;5240.842774716764;4562.156001139767;4570.428696412949;4588.609968152711;4596.862094137181;4609.516000819899;5394.676319420808;5491.862703432406;5515.972420137874;5660.943390566083;5664.745086471119;3750.9062273443383;3751.249750050001;3753.042974041602;3764.7741135531683;3775.131719704456;5814.040683287252;5845.006348920651;5866.648001119904;5879.088741245114;5879.853003674943;3705.8332375043187;3707.3141468828353;3712.7586706863967;3720.534933133358;3730.216654502585;3780.527434070741;3792.469054332396;3832.1760821423527;3841.769493830379;3925.1364699766004;4572.51988541205;4586.128635559233;4597.034622729264;4626.074785042938;4634.142683603544;5642.069058605284;5648.802291919763;5686.459786320293;5693.316801983706;5705.058665320175;1398.2100113435877;1407.8944079194102;1412.1668215752754;1412.7315809996069;1417.5322143692556;857.4640849469082;882.4925667741074;884.6770928611139;892.2683399612386;906.5965645287783;5469.56243500519;5491.505764481216;5500;5517;5521.033819081645;5916.9645312070215;5929.73316200772;5942.078977758454;5971.0744834550715;5972.790952316735;5457.290552228185;5484.232207490954;5497.39528651848;5513.2005859150195;5521.503064724194;3199.568058312145;3260.2990357073345;3285.3100848822014;3290.753193510496;3294.011796461052;6083.026715725463;6103.298120716086;6124.173236613;6141.201643786279;6165.136880836686;6058.212432383762;6059.878802423927;6067.302260240129;6085.361037091042;6102.755889764359;5964.850878728066;6077.088436734525;6081.361457046946;6088.330283668793;6112.327643959161;5678.4605462480995;5899.616524925866;5904.822855314175;5905.52755779528;5909.8227053188475;5624.100143976944;5670.121131224667;5705.686187259741;5729.512991395778;5773.7979170730505;5951.702414879325;6049.274087109575;6051.122587224916;6061.545384096298;6064.575479716377;3785.2051069275763;3843.885273270832;3855.6722678572637;3862.942055869108;3863.4398012288625;5777.7977770777825;5862.912056319244;5865.032269675456;5869.4717475427415;5890.970545147418;5703.543716502752;5708.086706127;5708.771649133988;5734.082546792493;5737.770489180386;5720.39935806751;5723.42765723441;5734.197212390185;5735.197072409783;5742.425757424224;5495.53287970527;5591.077472217039;5603.915941260966;5605.4114317997655;5619.494245517923;5677.403872593318;5703;5707;5712.514436272963;5744.224529688438;5594.38461769197;5602.13166959122;5616.775328986795;5626.043572592587;5627.465390787868 09:52:34 INFO - 2015-11-11 09:52:34,357 DEBUG : BROWSER_OUTPUT: |5;yui.html;646.1341801985338;648.9935100648992;667.4226793823339;672.3175976383972;678.304737643915;11991.700207494818;12076.879231207686;12155.453004614792;12158.635240942775;12490.937545312283;11669.824952625697;11721.648350549476;11757.70605734857;11764.294142351466;11768.588099416522;613.1569092497815;769.7152053740097;774.2760518914832;774.9847699513628;775.9806004849868;581.238577463522;779.76996785948;784.5136015670292;797.5374282915924;800.8678568036268;809.2837838512929;829.5852073963018;834.2991886815105;835.9122292159327;839.5969934431477;823.4112609484248;825.335604838105;826.1408135539032;826.5825757992205;826.5990994367727;606.4420732925674;611.1596554737237;611.7308384310888;611.9479844213247;612.3539665652735;11731.76536469266;11767.235129716626;11776.70558236051;11796.056315494825;11843.28940263587;9931.50342482873;10186.337888037328;10363.378197308186;10575.947120264427;10576.418296993663;7705.8844117338285;7768.53388796674;7778.338841198505;7848.097468791105;8079.555624440653;2620.882060307291;2626.2252635472582;2667.2398366465463;2685.5300322443495;2693.3493085914765;39760.40359394612;40023;40088;40209.19581608351;40616.187676246605;5977.880442391215;6164.599301045418;6174.166487524217;6184.103305020747;6212.627242365382;10200.642977495752;10208.795824083476;10225.386476811414;10266.384016959006;10293.485325733684;5024.171011783088;5059.87350316245;5110.821121260738;5300.257963885059;5304;3214.13218431027;3219.0825614700166;3316.966830331714;3343.749218808599;3364.158960259935;2305.2392710405525;2331.2306938710185;2333.2183718454166;2342.133410638041;2346.636271377939;349.81809459081643;353.0397319291523;353.31809607457853;353.6799196726966;354.52670684636297;396.0791160551671;469.47418890841794;496.9950300496949;519.649236765182;523.8140460136673;6413.583117097373;6840.589564626139;7161.749338773118;7321.121465424077;7365.226651201654;407.1104636369542;498.32228169689193;519.4831143012726;530.3423754544415;552.8258598541527;3137.743035674258;3181.141091905219;3211.6306624737986;3218.5976752905885;3274.9017529474154;50417.49582504202;50790.49209507932;50988.49011509911;51202.74398627983;51236.74381628068;41667.58332416637;42758.358624620654;42847.785761071;42858.35712464315;42907;41091.38362924558;41902.79048604737;42363.57636423596;42754;43018.13963720708;7001.579905205704;7195.82010449722;7259.564426134449;7264.34620884123;7297.963510182415;30973.845130774203;31347;32251.677483225805;32364.35271294514;32370.190745231557;38365.61634383732;38398.42402363911;39763.80118099391;42299.154016918874;42688.57311426846;6464.4828413725845;6542.378474044958;6690.732370705312;6729.92321228601;6762.763303284558;9431.104045115702;9665.178459830993;9734.513274336114;9762.951185244028;10173.338732982333;9106.499142547224;9236.907630923604;9251.398659087406;9335.906640933505;9836.655717049869;8817.426867253607;8834.867476987978;9165.519904166988;9370.156685898302;9578.90421095808;8570.800747110918;8837.140019860974;9034.503102329434;9057.72678021298;9376.859347109663;7748.147703752696;7775.416843736855;7877.84244315099;7879.724209652634;8385.245327920273;6982.406495447944;7290.270972902667;7344.228855970046;7392.303848075962;8121.4721043132 09:52:34 INFO - 2015-11-11 09:52:34,357 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:52:34 INFO - 2015-11-11 09:52:34,357 DEBUG : BROWSER_OUTPUT: __start_cc_report 09:52:34 INFO - 2015-11-11 09:52:34,358 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,292 09:52:34 INFO - 2015-11-11 09:52:34,358 DEBUG : BROWSER_OUTPUT: __end_cc_report 09:52:34 INFO - 2015-11-11 09:52:34,358 DEBUG : BROWSER_OUTPUT: __startTimestamp1447264354341__endTimestamp 09:52:34 INFO - 2015-11-11 09:52:34,358 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,359 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:52:34 INFO - 2015-11-11 09:52:34,359 DEBUG : BROWSER_OUTPUT: Number of tests: 6 09:52:34 INFO - 2015-11-11 09:52:34,359 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,359 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4858.29 Median:5028.09 stddev:534.43 (10.6%) stddev-sans-first:509.34 09:52:34 INFO - 2015-11-11 09:52:34,359 DEBUG : BROWSER_OUTPUT: Values: 2730.4 2780.8 2802.1 2843.1 2903.5 4819.6 4872.2 4908.0 4930.8 4976.9 4680.1 4796.1 4796.2 4823.1 4827.6 4441.0 4486.5 4492.0 4583.9 4622.5 4440.9 4475.5 4508.5 4512.3 4567.4 4459.3 4465.6 4535.5 4540.1 4556.8 4267.9 4388.7 4455.0 4526.9 4548.4 4457.2 4481.2 4492.1 4530.4 4546.1 4695.0 4731.5 4868.5 4886.1 4891.5 5101.7 5173.8 5187.9 5197.5 5209.7 5215.2 5222.4 5231.0 5252.7 5287.8 4666.2 4791.8 4874.0 4900.7 4918.8 5243.8 5300.7 5341.5 5359.1 5405.9 5176.7 5184.0 5198.6 5199.8 5254.7 5076.1 5089.4 5180.0 5256.7 5316.5 5109.9 5168.3 5168.6 5185.0 5198.9 5184.7 5190.9 5193.0 5197.5 5216.5 3932.1 3984.7 4015.0 4064.3 4081.2 3644.5 3666.7 3676.5 3706.2 3723.4 4940.9 4966.6 4968.8 4974.4 5037.8 5067.2 5190.6 5192.2 5275.0 5301.8 4952.3 4971.6 4994.7 4995.1 5066.4 4436.8 4608.3 4640.5 4660.9 4675.6 5302.2 5329.7 5381.1 5397.2 5436.5 5277.0 5295.5 5296.4 5302.5 5345.8 5183.4 5318.4 5423.1 5438.1 5459.6 5081.8 5125.6 5130.8 5147.7 5189.8 5263.2 5272.5 5279.9 5302.1 5324.3 4925.7 4973.8 5097.1 5133.5 5187.0 5114.6 5121.9 5122.7 5154.4 5187.8 4900.2 4999.0 5021.8 5028.1 5074.4 4923.8 5001.9 5028.3 5118.1 5122.6 4931.3 5021.5 5036.1 5047.0 5055.6 09:52:34 INFO - 2015-11-11 09:52:34,359 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,360 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:40376.23 Median:33573.49 stddev:64636.60 (192.5%) stddev-sans-first:64748.49 09:52:34 INFO - 2015-11-11 09:52:34,360 DEBUG : BROWSER_OUTPUT: Values: 475.1 476.1 479.2 489.6 518.1 32720.8 33546.0 33601.0 33719.8 33897.0 36167.6 36692.0 36780.6 36791.6 37037.3 8028.9 8095.8 8151.3 8188.5 8194.3 7880.6 8031.0 8041.5 8047.3 8071.5 7954.9 8053.1 8063.5 8079.9 8141.3 8023.4 8082.2 8122.4 8128.1 8151.7 7829.7 7972.2 7979.2 7991.7 8018.7 33790.5 34163.7 34190.7 34235.0 34277.0 2651.0 3052.7 3109.8 3123.5 3136.7 23555.4 23931.4 23931.5 24115.2 24641.5 1918.3 2008.0 2008.2 2012.8 2092.5 242202.8 243091.0 244242.0 246051.0 246425.0 46193.5 48187.0 51977.0 52310.2 54189.5 52834.0 53139.7 53295.7 53666.5 54049.5 13355.2 13504.3 13521.1 13556.2 13584.5 10251.0 10271.6 10274.1 10292.9 10304.3 17357.3 17499.5 17567.5 17611.9 17655.5 7368.4 7581.3 7611.6 7613.4 7701.7 780.6 845.8 852.7 891.7 1013.6 24761.6 25013.7 25018.1 25034.5 25136.2 921.6 963.0 1004.8 1034.4 1038.0 12843.6 12950.8 12987.5 13049.7 13125.2 253311.0 255242.0 256114.0 258068.0 258992.0 46983.8 47057.8 47144.1 47272.3 47456.0 1201.0 1206.6 1214.9 1218.2 1222.1 24180.6 24873.5 24930.5 24986.9 25000.5 40127.2 40305.2 40335.4 40402.4 40838.4 241061.0 242808.0 244087.0 244552.0 245515.0 28004.4 36407.3 38239.2 38332.2 38355.0 36255.6 36873.6 37098.6 37504.8 37587.2 29744.7 31263.4 31596.8 31597.8 31598.5 30620.5 30878.0 30916.4 30937.5 30948.1 34285.5 34435.3 34650.7 34914.0 34917.8 29655.9 32188.4 32483.4 32750.3 35083.6 26473.2 26498.9 26713.9 26925.9 27013.5 09:52:34 INFO - 2015-11-11 09:52:34,360 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,360 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:22329.83 Median:445445.00 stddev:74036.43 (16.6%) stddev-sans-first:74225.62 09:52:34 INFO - 2015-11-11 09:52:34,362 DEBUG : BROWSER_OUTPUT: Values: 291.9 297.9 299.0 300.6 307.1 10096.2 10556.5 15218.8 15401.1 15755.3 9892.2 10076.6 10237.6 10346.3 10376.2 3835.9 3933.7 3939.3 3940.1 3943.5 3797.4 3868.8 3915.7 3917.4 3971.1 2902.7 3025.9 3849.0 3863.4 4075.4 4144.5 4152.0 4168.0 4172.1 4182.5 3447.5 3530.7 3540.6 3540.7 3552.3 11264.1 11295.9 11540.2 11565.8 11568.1 1565.1 1576.0 1655.8 1672.6 1793.0 8236.2 8247.4 8255.5 8484.8 8490.8 1354.3 1392.2 1393.7 1400.3 1408.5 45671.8 45715.1 46098.3 46926.0 47377.3 5549.5 5642.2 5703.6 5740.3 5762.7 6380.0 6441.4 6461.9 6468.5 6471.6 4642.4 4682.6 4702.0 4720.3 4733.8 4955.0 4961.4 4972.0 5003.7 5017.8 2508.8 2529.1 2534.6 2551.3 2552.1 905.9 908.8 909.1 924.7 964.8 360.4 361.4 375.2 383.0 395.1 8664.8 9801.4 10063.6 10154.5 10228.8 381.5 396.9 400.3 400.6 415.9 5283.6 5361.1 5362.9 5420.4 5425.4 444246.0 446644.0 455751.0 455998.0 457213.0 60789.4 61043.0 61518.0 62238.0 62652.0 430.1 435.3 436.4 437.4 441.6 9634.8 9699.9 9740.1 9831.5 9909.1 29886.6 30222.0 30229.8 30798.2 30934.7 39595.2 40157.8 40192.4 40419.4 40452.2 5284.6 5312.3 5414.4 5415.8 5418.8 9936.7 9994.1 10153.7 10242.1 10249.9 8671.4 8831.8 8921.2 8923.6 8983.9 8200.2 8524.1 8530.1 8577.3 8814.5 8767.3 8916.3 9009.0 9047.3 9109.3 5324.6 5362.2 5393.1 5402.2 5406.8 8805.6 8884.7 8931.8 9030.5 9050.8 09:52:34 INFO - 2015-11-11 09:52:34,362 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,362 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4876.99 Median:6170.01 stddev:2529.81 (41.0%) stddev-sans-first:2523.80 09:52:34 INFO - 2015-11-11 09:52:34,363 DEBUG : BROWSER_OUTPUT: Values: 1449.9 1514.3 1548.9 1562.5 1565.5 6337.6 6472.0 6985.5 7249.6 7256.5 6718.9 6804.4 6915.2 6926.0 6949.1 1938.7 1976.2 1978.0 1979.0 1997.0 1964.1 2003.8 2008.8 2008.9 2014.2 1945.0 1948.1 1969.8 1971.1 1973.1 1938.5 1951.3 1952.2 1963.0 1986.4 1930.6 1938.1 1954.6 1991.1 1993.6 7000.1 7073.6 7078.9 7089.5 7119.9 4217.7 4281.8 4292.5 4297.2 4300.6 2137.1 2195.0 2395.9 2491.2 2491.7 718.3 718.9 739.8 753.0 762.4 9347.1 9436.2 9470.8 9493.1 9529.1 3798.2 3819.2 3896.2 3912.9 3917.6 8162.0 8179.5 8194.1 8208.7 8216.5 4328.2 4335.4 4338.4 4341.0 4380.1 3895.6 3920.5 3924.1 3928.6 3929.7 3246.6 3333.6 3371.3 3373.8 3379.8 1068.6 1097.4 1097.9 1098.7 1101.7 909.2 949.3 1162.1 1175.8 1179.6 6566.3 6658.9 6671.0 6718.9 6725.0 933.4 950.6 953.9 1011.6 1034.2 5179.9 5196.2 5220.2 5234.2 5240.7 7643.8 7973.9 8219.6 8435.7 8477.6 8249.9 8299.8 8331.8 8362.5 8382.8 6468.4 6612.2 6641.7 6643.9 6708.6 6535.2 6536.4 6540.3 6542.4 6573.7 7294.7 7367.5 7401.7 7421.0 7438.3 7502.2 7568.4 7720.8 7734.4 7740.4 5813.7 5898.6 5913.8 5922.2 5925.2 6654.7 6763.4 6778.6 6791.1 6828.4 6255.2 6309.9 6368.5 6394.0 6421.9 6142.8 6222.0 6256.8 6277.4 6283.4 6197.2 6305.5 6351.3 6354.2 6367.9 5765.8 5779.7 5786.7 5798.8 5822.8 5824.4 5840.9 5869.3 5873.9 5899.1 09:52:34 INFO - 2015-11-11 09:52:34,363 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,364 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4727.46 Median:5493.70 stddev:1459.07 (26.6%) stddev-sans-first:1424.26 09:52:34 INFO - 2015-11-11 09:52:34,365 DEBUG : BROWSER_OUTPUT: Values: 268.4 277.0 281.4 284.1 288.8 5167.9 5325.6 5434.4 5441.6 5466.1 5303.2 5382.5 5395.6 5408.8 5415.4 4129.3 4135.6 4137.9 4138.2 4163.3 4102.3 4121.4 4121.7 4140.4 4176.7 4094.2 4098.9 4156.9 4157.9 4159.4 3985.2 4052.3 4058.1 4067.6 4130.8 3465.0 3476.9 3479.1 3484.4 3493.4 5211.2 5228.3 5230.2 5235.3 5240.8 4562.2 4570.4 4588.6 4596.9 4609.5 5394.7 5491.9 5516.0 5660.9 5664.7 3750.9 3751.2 3753.0 3764.8 3775.1 5814.0 5845.0 5866.6 5879.1 5879.9 3705.8 3707.3 3712.8 3720.5 3730.2 3780.5 3792.5 3832.2 3841.8 3925.1 4572.5 4586.1 4597.0 4626.1 4634.1 5642.1 5648.8 5686.5 5693.3 5705.1 1398.2 1407.9 1412.2 1412.7 1417.5 857.5 882.5 884.7 892.3 906.6 5469.6 5491.5 5500.0 5517.0 5521.0 5917.0 5929.7 5942.1 5971.1 5972.8 5457.3 5484.2 5497.4 5513.2 5521.5 3199.6 3260.3 3285.3 3290.8 3294.0 6083.0 6103.3 6124.2 6141.2 6165.1 6058.2 6059.9 6067.3 6085.4 6102.8 5964.9 6077.1 6081.4 6088.3 6112.3 5678.5 5899.6 5904.8 5905.5 5909.8 5624.1 5670.1 5705.7 5729.5 5773.8 5951.7 6049.3 6051.1 6061.5 6064.6 3785.2 3843.9 3855.7 3862.9 3863.4 5777.8 5862.9 5865.0 5869.5 5891.0 5703.5 5708.1 5708.8 5734.1 5737.8 5720.4 5723.4 5734.2 5735.2 5742.4 5495.5 5591.1 5603.9 5605.4 5619.5 5677.4 5703.0 5707.0 5712.5 5744.2 5594.4 5602.1 5616.8 5626.0 5627.5 09:52:34 INFO - 2015-11-11 09:52:34,365 DEBUG : BROWSER_OUTPUT: 09:52:34 INFO - 2015-11-11 09:52:34,365 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11504.51 Median:527.08 stddev:14076.07 (2670.6%) stddev-sans-first:14091.94 09:52:34 INFO - 2015-11-11 09:52:34,367 DEBUG : BROWSER_OUTPUT: Values: 646.1 649.0 667.4 672.3 678.3 11991.7 12076.9 12155.5 12158.6 12490.9 11669.8 11721.6 11757.7 11764.3 11768.6 613.2 769.7 774.3 775.0 776.0 581.2 779.8 784.5 797.5 800.9 809.3 829.6 834.3 835.9 839.6 823.4 825.3 826.1 826.6 826.6 606.4 611.2 611.7 611.9 612.4 11731.8 11767.2 11776.7 11796.1 11843.3 9931.5 10186.3 10363.4 10575.9 10576.4 7705.9 7768.5 7778.3 7848.1 8079.6 2620.9 2626.2 2667.2 2685.5 2693.3 39760.4 40023.0 40088.0 40209.2 40616.2 5977.9 6164.6 6174.2 6184.1 6212.6 10200.6 10208.8 10225.4 10266.4 10293.5 5024.2 5059.9 5110.8 5300.3 5304.0 3214.1 3219.1 3317.0 3343.7 3364.2 2305.2 2331.2 2333.2 2342.1 2346.6 349.8 353.0 353.3 353.7 354.5 396.1 469.5 497.0 519.6 523.8 6413.6 6840.6 7161.7 7321.1 7365.2 407.1 498.3 519.5 530.3 552.8 3137.7 3181.1 3211.6 3218.6 3274.9 50417.5 50790.5 50988.5 51202.7 51236.7 41667.6 42758.4 42847.8 42858.4 42907.0 41091.4 41902.8 42363.6 42754.0 43018.1 7001.6 7195.8 7259.6 7264.3 7298.0 30973.8 31347.0 32251.7 32364.4 32370.2 38365.6 38398.4 39763.8 42299.2 42688.6 6464.5 6542.4 6690.7 6729.9 6762.8 9431.1 9665.2 9734.5 9763.0 10173.3 9106.5 9236.9 9251.4 9335.9 9836.7 8817.4 8834.9 9165.5 9370.2 9578.9 8570.8 8837.1 9034.5 9057.7 9376.9 7748.1 7775.4 7877.8 7879.7 8385.2 6982.4 7290.3 7344.2 7392.3 8121.5 09:52:34 INFO - 2015-11-11 09:52:34,367 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:52:34 INFO - 2015-11-11 09:52:34,367 DEBUG : BROWSER_OUTPUT: 09:52:35 INFO - 2015-11-11 09:52:35,037 INFO : Browser exited with error code: 0 09:52:35 INFO - 2015-11-11 09:52:35,068 INFO : Completed test dromaeo_css (00:18:33) 09:52:35 INFO - 2015-11-11 09:52:35,068 INFO : Starting test kraken 09:52:35 INFO - 2015-11-11 09:52:35,069 DEBUG : operating with platform_type : mac_ 09:52:35 INFO - 2015-11-11 09:52:35,069 INFO : Initialising browser for kraken test... 09:52:35 INFO - 2015-11-11 09:52:35,083 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/tmpNHjy4q/profile http://localhost:50896/getInfo.html 09:52:38 INFO - 2015-11-11 09:52:38,370 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:52:38 INFO - 2015-11-11 09:52:38,371 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:52:38 INFO - 2015-11-11 09:52:38,371 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 09:52:38 INFO - 2015-11-11 09:52:38,371 DEBUG : BROWSER_OUTPUT: __metrics 09:52:39 INFO - 2015-11-11 09:52:39,080 INFO : Browser initialized. 09:52:39 INFO - 2015-11-11 09:52:39,080 INFO : Running cycle 1/1 for kraken test... 09:52:39 INFO - 2015-11-11 09:52:39,080 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/tmpNHjy4q/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:52:51 INFO - 2015-11-11 09:52:51,368 DEBUG : BROWSER_OUTPUT: RSS: Main: 240873472 09:52:51 INFO - 2015-11-11 09:52:51,368 DEBUG : BROWSER_OUTPUT: 09:52:54 INFO - 2015-11-11 09:52:54,176 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50896/tests/kraken/driver.html?testName=audio-beat-detection) 09:52:54 INFO - 2015-11-11 09:52:54,780 DEBUG : BROWSER_OUTPUT: RSS: Main: 259149824 09:52:54 INFO - 2015-11-11 09:52:54,781 DEBUG : BROWSER_OUTPUT: 09:52:57 INFO - 2015-11-11 09:52:57,730 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50896/tests/kraken/driver.html?testName=audio-dft) 09:52:58 INFO - 2015-11-11 09:52:58,330 DEBUG : BROWSER_OUTPUT: RSS: Main: 267431936 09:52:58 INFO - 2015-11-11 09:52:58,330 DEBUG : BROWSER_OUTPUT: 09:53:01 INFO - 2015-11-11 09:53:01,522 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50896/tests/kraken/driver.html?testName=audio-fft) 09:53:02 INFO - 2015-11-11 09:53:02,096 DEBUG : BROWSER_OUTPUT: RSS: Main: 267341824 09:53:02 INFO - 2015-11-11 09:53:02,096 DEBUG : BROWSER_OUTPUT: 09:53:04 INFO - 2015-11-11 09:53:04,273 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50896/tests/kraken/driver.html?testName=audio-oscillator) 09:53:04 INFO - 2015-11-11 09:53:04,867 DEBUG : BROWSER_OUTPUT: RSS: Main: 266936320 09:53:04 INFO - 2015-11-11 09:53:04,868 DEBUG : BROWSER_OUTPUT: 09:53:07 INFO - 2015-11-11 09:53:07,225 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50896/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:53:07 INFO - 2015-11-11 09:53:07,808 DEBUG : BROWSER_OUTPUT: RSS: Main: 267808768 09:53:07 INFO - 2015-11-11 09:53:07,808 DEBUG : BROWSER_OUTPUT: 09:53:11 INFO - 2015-11-11 09:53:11,222 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50896/tests/kraken/driver.html?testName=imaging-darkroom) 09:53:11 INFO - 2015-11-11 09:53:11,810 DEBUG : BROWSER_OUTPUT: RSS: Main: 268345344 09:53:11 INFO - 2015-11-11 09:53:11,810 DEBUG : BROWSER_OUTPUT: 09:53:15 INFO - 2015-11-11 09:53:15,326 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50896/tests/kraken/driver.html?testName=imaging-desaturate) 09:53:15 INFO - 2015-11-11 09:53:15,913 DEBUG : BROWSER_OUTPUT: RSS: Main: 266256384 09:53:15 INFO - 2015-11-11 09:53:15,913 DEBUG : BROWSER_OUTPUT: 09:53:19 INFO - 2015-11-11 09:53:19,130 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50896/tests/kraken/driver.html?testName=json-parse-financial) 09:53:19 INFO - 2015-11-11 09:53:19,719 DEBUG : BROWSER_OUTPUT: RSS: Main: 265838592 09:53:19 INFO - 2015-11-11 09:53:19,720 DEBUG : BROWSER_OUTPUT: 09:53:21 INFO - 2015-11-11 09:53:21,449 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50896/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:53:22 INFO - 2015-11-11 09:53:22,021 DEBUG : BROWSER_OUTPUT: RSS: Main: 266842112 09:53:22 INFO - 2015-11-11 09:53:22,022 DEBUG : BROWSER_OUTPUT: 09:53:24 INFO - 2015-11-11 09:53:24,014 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50896/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:53:24 INFO - 2015-11-11 09:53:24,645 DEBUG : BROWSER_OUTPUT: RSS: Main: 267587584 09:53:24 INFO - 2015-11-11 09:53:24,645 DEBUG : BROWSER_OUTPUT: 09:53:26 INFO - 2015-11-11 09:53:26,980 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50896/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:53:27 INFO - 2015-11-11 09:53:27,579 DEBUG : BROWSER_OUTPUT: RSS: Main: 268316672 09:53:27 INFO - 2015-11-11 09:53:27,580 DEBUG : BROWSER_OUTPUT: 09:53:30 INFO - 2015-11-11 09:53:30,468 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50896/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:53:31 INFO - 2015-11-11 09:53:31,061 DEBUG : BROWSER_OUTPUT: RSS: Main: 267763712 09:53:31 INFO - 2015-11-11 09:53:31,062 DEBUG : BROWSER_OUTPUT: 09:53:33 INFO - 2015-11-11 09:53:33,999 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50896/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:53:34 INFO - 2015-11-11 09:53:34,593 DEBUG : BROWSER_OUTPUT: RSS: Main: 267628544 09:53:34 INFO - 2015-11-11 09:53:34,593 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,474 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50896/tests/kraken/driver.html?testName=ai-astar) 09:53:36 INFO - 2015-11-11 09:53:36,727 DEBUG : BROWSER_OUTPUT: RSS: Main: 269058048 09:53:36 INFO - 2015-11-11 09:53:36,727 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,727 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:53:36 INFO - 2015-11-11 09:53:36,727 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: |0;ai-astar;129;118;127;128;129;140;127;129;127;127 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;178;156;181;193;151;173;171;156;187;158 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: |2;audio-dft;190;193;203;195;194;194;191;185;198;195 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: |3;audio-fft;81;87;96;136;83;83;82;82;134;81 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;101;104;150;102;105;104;146;103;105;148 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;144;136;143;143;144;144;137;140;147;136 09:53:36 INFO - 2015-11-11 09:53:36,728 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;157;149;150;149;149;150;150;150;150;156 09:53:36 INFO - 2015-11-11 09:53:36,729 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;122;128;124;121;122;122;127;123;122;121 09:53:36 INFO - 2015-11-11 09:53:36,729 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;70;72;74;75;76;74;76;84;76;74 09:53:36 INFO - 2015-11-11 09:53:36,729 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;77;81;81;82;80;81;81;81;81;82 09:53:36 INFO - 2015-11-11 09:53:36,729 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;104;103;111;107;103;103;108;104;104;104 09:53:36 INFO - 2015-11-11 09:53:36,729 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;149;157;154;156;149;160;159;147;148;150 09:53:36 INFO - 2015-11-11 09:53:36,729 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;183;188;189;183;188;170;185;177;183;168 09:53:36 INFO - 2015-11-11 09:53:36,730 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;80;84;83;88;87;87;87;87;85;86 09:53:36 INFO - 2015-11-11 09:53:36,730 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:53:36 INFO - 2015-11-11 09:53:36,730 DEBUG : BROWSER_OUTPUT: __start_cc_report 09:53:36 INFO - 2015-11-11 09:53:36,730 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,726 09:53:36 INFO - 2015-11-11 09:53:36,730 DEBUG : BROWSER_OUTPUT: __end_cc_report 09:53:36 INFO - 2015-11-11 09:53:36,730 DEBUG : BROWSER_OUTPUT: __startTimestamp1447264416725__endTimestamp 09:53:36 INFO - 2015-11-11 09:53:36,730 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,732 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:53:36 INFO - 2015-11-11 09:53:36,732 DEBUG : BROWSER_OUTPUT: Number of tests: 14 09:53:36 INFO - 2015-11-11 09:53:36,732 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,733 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:128.10 Median:128.50 stddev:5.28 (4.1%) stddev-sans-first:5.59 09:53:36 INFO - 2015-11-11 09:53:36,733 DEBUG : BROWSER_OUTPUT: Values: 129.0 118.0 127.0 128.0 129.0 140.0 127.0 129.0 127.0 127.0 09:53:36 INFO - 2015-11-11 09:53:36,733 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,733 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:170.40 Median:175.50 stddev:14.56 (8.3%) stddev-sans-first:15.18 09:53:36 INFO - 2015-11-11 09:53:36,733 DEBUG : BROWSER_OUTPUT: Values: 178.0 156.0 181.0 193.0 151.0 173.0 171.0 156.0 187.0 158.0 09:53:36 INFO - 2015-11-11 09:53:36,733 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,734 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:193.80 Median:194.50 stddev:4.78 (2.5%) stddev-sans-first:4.87 09:53:36 INFO - 2015-11-11 09:53:36,734 DEBUG : BROWSER_OUTPUT: Values: 190.0 193.0 203.0 195.0 194.0 194.0 191.0 185.0 198.0 195.0 09:53:36 INFO - 2015-11-11 09:53:36,734 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,734 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:94.50 Median:82.50 stddev:21.81 (26.4%) stddev-sans-first:22.58 09:53:36 INFO - 2015-11-11 09:53:36,734 DEBUG : BROWSER_OUTPUT: Values: 81.0 87.0 96.0 136.0 83.0 83.0 82.0 82.0 134.0 81.0 09:53:36 INFO - 2015-11-11 09:53:36,735 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,735 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:116.80 Median:105.00 stddev:21.59 (20.6%) stddev-sans-first:22.13 09:53:36 INFO - 2015-11-11 09:53:36,735 DEBUG : BROWSER_OUTPUT: Values: 101.0 104.0 150.0 102.0 105.0 104.0 146.0 103.0 105.0 148.0 09:53:36 INFO - 2015-11-11 09:53:36,735 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,735 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:141.40 Median:143.50 stddev:3.89 (2.7%) stddev-sans-first:4.01 09:53:36 INFO - 2015-11-11 09:53:36,735 DEBUG : BROWSER_OUTPUT: Values: 144.0 136.0 143.0 143.0 144.0 144.0 137.0 140.0 147.0 136.0 09:53:36 INFO - 2015-11-11 09:53:36,736 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,736 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:151.00 Median:150.00 stddev:2.94 (2.0%) stddev-sans-first:2.18 09:53:36 INFO - 2015-11-11 09:53:36,736 DEBUG : BROWSER_OUTPUT: Values: 157.0 149.0 150.0 149.0 149.0 150.0 150.0 150.0 150.0 156.0 09:53:36 INFO - 2015-11-11 09:53:36,736 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,736 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:123.20 Median:122.50 stddev:2.44 (2.0%) stddev-sans-first:2.55 09:53:36 INFO - 2015-11-11 09:53:36,736 DEBUG : BROWSER_OUTPUT: Values: 122.0 128.0 124.0 121.0 122.0 122.0 127.0 123.0 122.0 121.0 09:53:36 INFO - 2015-11-11 09:53:36,736 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,736 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:75.10 Median:75.50 stddev:3.67 (4.9%) stddev-sans-first:3.39 09:53:36 INFO - 2015-11-11 09:53:36,738 DEBUG : BROWSER_OUTPUT: Values: 70.0 72.0 74.0 75.0 76.0 74.0 76.0 84.0 76.0 74.0 09:53:36 INFO - 2015-11-11 09:53:36,738 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,738 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:80.70 Median:81.00 stddev:1.42 (1.8%) stddev-sans-first:0.60 09:53:36 INFO - 2015-11-11 09:53:36,738 DEBUG : BROWSER_OUTPUT: Values: 77.0 81.0 81.0 82.0 80.0 81.0 81.0 81.0 81.0 82.0 09:53:36 INFO - 2015-11-11 09:53:36,738 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,738 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:105.10 Median:104.00 stddev:2.69 (2.6%) stddev-sans-first:2.82 09:53:36 INFO - 2015-11-11 09:53:36,738 DEBUG : BROWSER_OUTPUT: Values: 104.0 103.0 111.0 107.0 103.0 103.0 108.0 104.0 104.0 104.0 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:152.90 Median:155.00 stddev:4.86 (3.1%) stddev-sans-first:4.95 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: Values: 149.0 157.0 154.0 156.0 149.0 160.0 159.0 147.0 148.0 150.0 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:181.40 Median:184.00 stddev:7.41 (4.0%) stddev-sans-first:7.84 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: Values: 183.0 188.0 189.0 183.0 188.0 170.0 185.0 177.0 183.0 168.0 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:85.40 Median:87.00 stddev:2.46 (2.8%) stddev-sans-first:1.66 09:53:36 INFO - 2015-11-11 09:53:36,739 DEBUG : BROWSER_OUTPUT: Values: 80.0 84.0 83.0 88.0 87.0 87.0 87.0 87.0 85.0 86.0 09:53:36 INFO - 2015-11-11 09:53:36,740 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:53:36 INFO - 2015-11-11 09:53:36,740 DEBUG : BROWSER_OUTPUT: 09:53:37 INFO - 2015-11-11 09:53:37,441 INFO : Browser exited with error code: 0 09:53:37 INFO - 2015-11-11 09:53:37,496 INFO : Completed test kraken (00:01:02) 09:53:37 INFO - 2015-11-11 09:53:37,496 INFO : Starting test v8_7 09:53:37 INFO - 2015-11-11 09:53:37,496 DEBUG : operating with platform_type : mac_ 09:53:37 INFO - 2015-11-11 09:53:37,496 INFO : Initialising browser for v8_7 test... 09:53:37 INFO - 2015-11-11 09:53:37,510 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/tmpVoLLoL/profile http://localhost:50896/getInfo.html 09:53:40 INFO - 2015-11-11 09:53:40,776 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:53:40 INFO - 2015-11-11 09:53:40,776 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:53:40 INFO - 2015-11-11 09:53:40,776 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 09:53:40 INFO - 2015-11-11 09:53:40,776 DEBUG : BROWSER_OUTPUT: __metrics 09:53:41 INFO - 2015-11-11 09:53:41,458 INFO : Browser initialized. 09:53:41 INFO - 2015-11-11 09:53:41,459 INFO : Running cycle 1/1 for v8_7 test... 09:53:41 INFO - 2015-11-11 09:53:41,459 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/T/tmpVoLLoL/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:53:53 INFO - 2015-11-11 09:53:53,757 DEBUG : BROWSER_OUTPUT: RSS: Main: 240328704 09:53:53 INFO - 2015-11-11 09:53:53,757 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,347 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50896/tests/v8_7/run.html (next: http://localhost:50896/tests/v8_7/run.html) 09:54:16 INFO - 2015-11-11 09:54:16,608 DEBUG : BROWSER_OUTPUT: RSS: Main: 260288512 09:54:16 INFO - 2015-11-11 09:54:16,608 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,608 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:54:16 INFO - 2015-11-11 09:54:16,608 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:54:16 INFO - 2015-11-11 09:54:16,608 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:54:16 INFO - 2015-11-11 09:54:16,609 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:54:16 INFO - 2015-11-11 09:54:16,609 DEBUG : BROWSER_OUTPUT: |0;Richards;852.5149190110827 09:54:16 INFO - 2015-11-11 09:54:16,609 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;225.93764121102575 09:54:16 INFO - 2015-11-11 09:54:16,609 DEBUG : BROWSER_OUTPUT: |2;Encrypt;367.37692872887584 09:54:16 INFO - 2015-11-11 09:54:16,609 DEBUG : BROWSER_OUTPUT: |3;Decrypt;6635.761589403974 09:54:16 INFO - 2015-11-11 09:54:16,609 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1295.3367875647668 09:54:16 INFO - 2015-11-11 09:54:16,609 DEBUG : BROWSER_OUTPUT: |5;Earley;893.6550491510277 09:54:16 INFO - 2015-11-11 09:54:16,609 DEBUG : BROWSER_OUTPUT: |6;Boyer;14623.188405797102 09:54:16 INFO - 2015-11-11 09:54:16,610 DEBUG : BROWSER_OUTPUT: |7;RegExp;32725.8064516129 09:54:16 INFO - 2015-11-11 09:54:16,610 DEBUG : BROWSER_OUTPUT: |8;Splay;747.3841554559043 09:54:16 INFO - 2015-11-11 09:54:16,610 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;6519.480519480519 09:54:16 INFO - 2015-11-11 09:54:16,610 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:54:16 INFO - 2015-11-11 09:54:16,610 DEBUG : BROWSER_OUTPUT: __startTimestamp1447264456597__endTimestamp 09:54:16 INFO - 2015-11-11 09:54:16,610 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,610 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:54:16 INFO - 2015-11-11 09:54:16,611 DEBUG : BROWSER_OUTPUT: Number of tests: 10 09:54:16 INFO - 2015-11-11 09:54:16,611 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,611 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:852.51 Median:852.51 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,611 DEBUG : BROWSER_OUTPUT: Values: 852.5 09:54:16 INFO - 2015-11-11 09:54:16,611 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,611 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:225.94 Median:225.94 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,611 DEBUG : BROWSER_OUTPUT: Values: 225.9 09:54:16 INFO - 2015-11-11 09:54:16,611 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,612 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:367.38 Median:367.38 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,612 DEBUG : BROWSER_OUTPUT: Values: 367.4 09:54:16 INFO - 2015-11-11 09:54:16,612 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,612 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:6635.76 Median:6635.76 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,612 DEBUG : BROWSER_OUTPUT: Values: 6635.8 09:54:16 INFO - 2015-11-11 09:54:16,612 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,612 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1295.34 Median:1295.34 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,612 DEBUG : BROWSER_OUTPUT: Values: 1295.3 09:54:16 INFO - 2015-11-11 09:54:16,613 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,613 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:893.66 Median:893.66 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,613 DEBUG : BROWSER_OUTPUT: Values: 893.7 09:54:16 INFO - 2015-11-11 09:54:16,613 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,613 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:14623.19 Median:14623.19 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,613 DEBUG : BROWSER_OUTPUT: Values: 14623.2 09:54:16 INFO - 2015-11-11 09:54:16,613 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,613 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:32725.81 Median:32725.81 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: Values: 32725.8 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:747.38 Median:747.38 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: Values: 747.4 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:6519.48 Median:6519.48 stddev:0.00 (0.0%) 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: Values: 6519.5 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:54:16 INFO - 2015-11-11 09:54:16,614 DEBUG : BROWSER_OUTPUT: 09:54:17 INFO - 2015-11-11 09:54:17,335 INFO : Browser exited with error code: 0 09:54:17 INFO - 2015-11-11 09:54:17,357 INFO : Completed test v8_7 (00:00:39) 09:54:17 INFO - 2015-11-11 09:54:17,566 INFO : Completed test suite (00:20:15) 09:54:17 INFO - 2015-11-11 09:54:17,566 DEBUG : Working with test: dromaeo_css 09:54:17 INFO - 2015-11-11 09:54:17,566 DEBUG : Generating results file: dromaeo_css 09:54:17 INFO - 2015-11-11 09:54:17,567 DEBUG : Working with test: kraken 09:54:17 INFO - 2015-11-11 09:54:17,567 DEBUG : Generating results file: kraken 09:54:17 INFO - 2015-11-11 09:54:17,567 INFO : javascript benchmark 09:54:17 INFO - 2015-11-11 09:54:17,567 DEBUG : Working with test: v8_7 09:54:17 INFO - 2015-11-11 09:54:17,567 DEBUG : Generating results file: v8_7 09:54:17 INFO - 2015-11-11 09:54:17,567 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:54:17 INFO - 2015-11-11 09:54:17,623 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,57]] 09:54:17 INFO - 2015-11-11 09:54:17,624 DEBUG : process_Request line: dromaeo_css 5809.97 graph.html#tests=[[72,64,57]] 09:54:17 INFO - 2015-11-11 09:54:17,624 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:54:17 INFO - 2015-11-11 09:54:17,654 DEBUG : process_Request line: kraken 1799.80 graph.html#tests=[[232,64,57]] 09:54:17 INFO - 2015-11-11 09:54:17,655 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:54:17 INFO - 2015-11-11 09:54:17,687 DEBUG : process_Request line: v8_7 14791.80 graph.html#tests=[[230,64,57]] 09:54:17 INFO - 2015-11-11 09:54:17,688 INFO : javascript benchmark 09:54:17 INFO - 2015-11-11 09:54:17,690 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [291.8715765063371, 297.89275860690145, 298.95067313893225, 300.60020173169687, 307.1231633685826, 10096.192304615632, 10556.472176391188, 15218.847811521882, 15401.075935443867, 15755.291011904463, 9892.15916647086, 10076.596936122565, 10237.641682541112, 10346.275760696753, 10376.169906407487, 3835.923281534375, 3933.6656384207377, 3939.2712348215528, 3940.0937784309626, 3943.507061617298, 3797.3734333835023, 3868.825902834365, 3915.725899187058, 3917.3536366499493, 3971.126352202511, 2902.680705122435, 3025.909222723322, 3849.0377405648587, 3863.420486926955, 4075.4498142750645, 4144.502659680843, 4152.024274295538, 4167.999680076759, 4172.061286210594, 4182.498100227992, 3447.517347571342, 3530.735194860396, 3540.6459354064646, 3540.6636369544854, 3552.342816578941, 11264.098872090213, 11295.887041129567, 11540.192186546945, 11565.826512602318, 11568.132390070778, 1565.1157096240702, 1575.952721418348, 1655.8178600353951, 1672.6320209553878, 1792.9551761205944, 8236.217559331913, 8247.422680412374, 8255.504669719836, 8484.78788030298, 8490.830183396298, 1354.3093022558467, 1392.2481859795698, 1393.7491251574713, 1400.2858542143479, 1408.4859026455372, 45671.77164114158, 45715.085698285846, 46098.308525372144, 46926.0, 47377.28934066026, 5549.528290095387, 5642.153676948408, 5703.600747947687, 5740.339860915965, 5762.683052432073, 6380.0, 6441.420272175526, 6461.870762584722, 6468.5472016958365, 6471.579347342407, 4642.3500709900645, 4682.648801339913, 4701.976490117528, 4720.33915251865, 4733.810647574059, 4954.9752251238515, 4961.404631444249, 4971.975140124277, 5003.699778013331, 5017.774200161001, 2508.7992960563474, 2529.127451029392, 2534.5817940040056, 2551.2983929419556, 2552.1322750265, 905.9365844390829, 908.8318661047728, 909.0727457992942, 924.699472671371, 964.8022155458115, 360.423322683704, 361.3766253213239, 375.167128973678, 383.0290214306719, 395.11888488669854, 8664.783380415414, 9801.411915285105, 10063.64777232808, 10154.492275386201, 10228.846567301496, 381.4564245949511, 396.9047428617111, 400.3054700095332, 400.5733893403516, 415.86692258476995, 5283.6037297202865, 5361.115415956401, 5362.946370536322, 5420.430854760193, 5425.403205647375, 444246.0, 446644.0, 455751.0, 455998.0, 457213.0, 60789.392106079256, 61043.0, 61518.0, 62238.0, 62652.0, 430.1053808079188, 435.27743945051066, 436.3694461503097, 437.40512902453276, 441.5562359828416, 9634.759131021781, 9699.854502182614, 9740.149371619369, 9831.459269740233, 9909.058639429242, 29886.551701724926, 30222.0, 30229.848850755607, 30798.230044249074, 30934.69065309318, 39595.2080958385, 40157.79921100376, 40192.39711404273, 40419.3937090938, 40452.19095618012, 5284.550813180923, 5312.309399778004, 5414.35027796667, 5415.783368665367, 5418.810341638024, 9936.652217172654, 9994.10053095225, 10153.664657128755, 10242.078212960869, 10249.9487502562, 8671.4363566368, 8831.779205519913, 8921.15249051339, 8923.553822308728, 8983.910160898307, 8200.179982001751, 8524.147585241426, 8530.061693213866, 8577.270931970852, 8814.471131732116, 8767.298616110824, 8916.28669706435, 9008.954955225181, 9047.276217902421, 9109.271258299452, 5324.600654950972, 5362.195670649277, 5393.1370980642905, 5402.216678581663, 5406.810761623325, 8805.603747831492, 8884.689035883714, 8931.821363572823, 9030.45817250967, 9050.778144950611], "dojo.html": [2730.440259746752, 2780.81924674896, 2802.075315146002, 2843.1470558832343, 2903.4773740726687, 4819.638527110467, 4872.196087645534, 4908.04293162833, 4930.7534623268875, 4976.925346119811, 4680.1107789519965, 4796.064767370364, 4796.208625576775, 4823.107725070856, 4827.589654879331, 4441.022974945515, 4486.506484286726, 4491.977540112295, 4583.862484125465, 4622.537746225385, 4440.933385999213, 4475.530069342721, 4508.458984921814, 4512.345709872066, 4567.4062371891605, 4459.264221403465, 4465.598096171344, 4535.455745310567, 4540.091981603676, 4556.794944227518, 4267.91464170718, 4388.692791504596, 4455.0, 4526.864194074183, 4548.363229147922, 4457.1977044132045, 4481.215787237221, 4492.124035813018, 4530.365748795171, 4546.113507865967, 4694.953050469486, 4731.4795372509, 4868.488808675073, 4886.071646387175, 4891.535304146136, 5101.744912754384, 5173.81891633791, 5187.948120518784, 5197.454267301954, 5209.739513024371, 5215.16557350822, 5222.399424066205, 5231.0, 5252.65857719247, 5287.841364759063, 4666.230072038144, 4791.832285870048, 4873.951260487421, 4900.705957642553, 4918.778654960535, 5243.764030618631, 5300.655457395257, 5341.519263266325, 5359.142537194109, 5405.918911216335, 5176.7411629418375, 5184.040952423814, 5198.636095473281, 5199.818006369835, 5254.6847189168775, 5076.111680455905, 5089.440161582223, 5180.0, 5256.710880901587, 5316.521513063843, 5109.923351149736, 5168.2764412982215, 5168.61235407346, 5185.0, 5198.92201616976, 5184.688918664892, 5190.922136167885, 5193.0, 5197.480251974848, 5216.530512253839, 3932.095618007817, 3984.7210695251633, 4014.9598504014584, 4064.2684316822665, 4081.1837632473625, 3644.4533320001683, 3666.651668091527, 3676.4669122977552, 3706.184639379332, 3723.422869455239, 4940.876478088005, 4966.627502937295, 4968.826091086795, 4974.427940786783, 5037.773300201499, 5067.214581739836, 5190.6107041971245, 5192.221166825007, 5275.0, 5301.761420735999, 4952.331435256267, 4971.577415919687, 4994.700317980933, 4995.100881841304, 5066.392032956069, 4436.7559784211535, 4608.28571571407, 4640.489546149921, 4660.883477913079, 4675.57919787214, 5302.151655735064, 5329.706866122323, 5381.11211650089, 5397.217403476396, 5436.483534064258, 5276.973615131899, 5295.549878260391, 5296.443873393392, 5302.522772950453, 5345.75944082525, 5183.352080989876, 5318.4149743527405, 5423.050966080999, 5438.075527160313, 5459.590530710133, 5081.822136225214, 5125.641205115606, 5130.769115389742, 5147.6654017488745, 5189.766460509361, 5263.184206448007, 5272.525472707474, 5279.89440211186, 5302.125149350314, 5324.334458192726, 4925.729084900365, 4973.825916092919, 5097.133487307093, 5133.512316329943, 5187.04039752647, 5114.5652619527755, 5121.948780512147, 5122.692638441706, 5154.433012368711, 5187.792488300426, 4900.191468407673, 4999.0251900878975, 5021.7740201690285, 5028.094942910311, 5074.441811400669, 4923.778429970588, 5001.924971125363, 5028.321176641107, 5118.129917913889, 5122.615803814803, 4931.309616653743, 5021.548060674557, 5036.143855544493, 5046.9747651261505, 5055.5955523557295], "mootools.html": [1449.8767604753596, 1514.3488300030986, 1548.914809685467, 1562.4921900382378, 1565.5068653374187, 6337.588056776306, 6472.0, 6985.511014229006, 7249.637518124086, 7256.5283256588355, 6718.865622687544, 6804.421624161952, 6915.204751453584, 6925.995730619057, 6949.131358580177, 1938.6801177805646, 1976.2490253703572, 1978.0307649251836, 1979.0203849094646, 1996.951600409782, 1964.0572525187918, 2003.7996200379991, 2008.849336299776, 2008.9397318080407, 2014.1943222710959, 1945.046927005764, 1948.1136083082163, 1969.803019698033, 1971.142552989447, 1973.1022384814876, 1938.4766113149442, 1951.2975328881591, 1952.2386269354963, 1963.0, 1986.384220891521, 1930.6428310762412, 1938.0697265312588, 1954.6383918975034, 1991.1338567723087, 1993.5614164883702, 7000.054992575988, 7073.646317684147, 7078.858422831566, 7089.468289878279, 7119.857602847914, 4217.725847819882, 4281.828726850922, 4292.527821939584, 4297.226499230137, 4300.6344460720875, 2137.10241698487, 2194.9561008779733, 2395.8921848516857, 2491.2277194069898, 2491.7383674714256, 718.2888939949412, 718.9209186989427, 739.8187444076182, 752.9661165247577, 762.4434163060942, 9347.112024357742, 9436.197923176469, 9470.810583788285, 9493.05069493052, 9529.142377186017, 3798.1833905710405, 3819.1597848473293, 3896.2402331545077, 3912.941305880414, 3917.6474117329576, 8161.959190204129, 8179.509229446252, 8194.139615340304, 8208.671653133928, 8216.548089854996, 4328.242557552416, 4335.436393268855, 4338.414314067623, 4341.0449701066345, 4380.123975204971, 3895.5909629488497, 3920.4903362563255, 3924.0778417071965, 3928.5874983126932, 3929.6659783918117, 3246.62663793662, 3333.5999680038067, 3371.292028673957, 3373.797572145679, 3379.7803142795638, 1068.6046162919613, 1097.3744965369822, 1097.8627671541058, 1098.6813823991113, 1101.7245688577855, 909.1817364371985, 949.2975198353168, 1162.1342100135453, 1175.8236264560385, 1179.5576658752968, 6566.343365663395, 6658.866822663616, 6671.032700258435, 6718.865622687616, 6724.966375168093, 933.3979583168954, 950.5912457643279, 953.8950715421298, 1011.6155860773007, 1034.1726618705006, 5179.870503237449, 5196.194589838581, 5220.190870415092, 5234.162533994542, 5240.68555886648, 7643.847123057508, 7973.9202607973175, 8219.589020548949, 8435.704750333709, 8477.618507167192, 8249.917500824915, 8299.751007469786, 8331.791705207419, 8362.498250105013, 8382.832343353099, 6468.417842394207, 6612.206535215805, 6641.667916604247, 6643.933560664332, 6708.563943343667, 6535.150430444012, 6536.379043990813, 6540.280569137296, 6542.443892269211, 6573.704183311666, 7294.671739771617, 7367.521111127974, 7401.7039318428815, 7421.0, 7438.330550250504, 7502.249775022454, 7568.356689681439, 7720.806979825549, 7734.381249499914, 7740.380769538311, 5813.651180928989, 5898.587098903035, 5913.793017244376, 5922.200502932222, 5925.229720136354, 6654.667266636746, 6763.391294783493, 6778.627175505395, 6791.117154769849, 6828.351306625863, 6255.218097737783, 6309.873802523832, 6368.490520758421, 6394.008928616072, 6421.935780642134, 6142.815715528542, 6221.96889015552, 6256.812295631138, 6277.403646653561, 6283.434490895841, 6197.194364732736, 6305.5270854687, 6351.3331100235655, 6354.17395738551, 6367.936320636734, 5765.827025189251, 5779.653220806765, 5786.710664466844, 5798.82603521895, 5822.82531524055, 5824.359320474659, 5840.890230856124, 5869.295684517885, 5873.853153671193, 5899.144624029406], "ext.html": [475.0783480048705, 476.05740633545577, 479.2332268370607, 489.6425609305206, 518.1062666899596, 32720.836395818016, 33545.99999999994, 33600.98394096356, 33719.831400842995, 33897.0, 36167.63832361675, 36692.0, 36780.63219367806, 36791.63208367916, 37037.25925481489, 8028.879566806488, 8095.838083238332, 8151.266386025257, 8188.54962977036, 8194.30348420382, 7880.64537095832, 8031.03627564693, 8041.477303975252, 8047.315978141835, 8071.475354101994, 7954.920450795505, 8053.1141574426765, 8063.516189028648, 8079.9192008080045, 8141.307988820958, 8023.4383593148505, 8082.19178082193, 8122.350211983056, 8128.105908350077, 8151.673933042671, 7829.725959591444, 7972.162922893129, 7979.162187970238, 7991.680332786682, 8018.67925282988, 33790.49314260288, 34163.658363416296, 34190.658093419, 34235.0, 34277.0, 2650.973490265092, 3052.6642069372574, 3109.782315237934, 3123.5314702794535, 3136.6549679535233, 23555.411114722097, 23931.40171495709, 23931.52136957251, 24115.155969541156, 24641.507169856683, 1918.3189967561455, 2007.979920200794, 2008.2469074097214, 2012.7785943546198, 2092.529180934293, 242202.7889860557, 243091.0, 244242.0, 246051.0, 246425.0, 46193.5380646196, 48187.0, 51977.0, 52310.21534676983, 54189.45810541923, 52834.0, 53139.734301328244, 53295.73352133214, 53666.46333536693, 54049.459505405226, 13355.198688078746, 13504.257265850472, 13521.121127126706, 13556.186628802303, 13584.524541641193, 10251.0, 10271.640492582725, 10274.075333220046, 10292.948535257425, 10304.278700490893, 17357.3057077718, 17499.475015749547, 17567.472975810746, 17611.911940440474, 17655.470335889942, 7368.447366447538, 7581.279778421042, 7611.619419029026, 7613.401185750943, 7701.653425595861, 780.6135962698387, 845.7758693946109, 852.6887685994567, 891.7191084808394, 1013.6452241715341, 24761.62857557138, 25013.749862501143, 25018.12436564748, 25034.499310013696, 25136.24591262265, 921.613022272318, 962.9855552166723, 1004.7839714461426, 1034.4310629154086, 1038.0190719769896, 12843.550475733304, 12950.805737913939, 12987.545435909888, 13049.673758156123, 13125.212487250796, 253311.0, 255242.0, 256114.0, 258068.0, 258992.0, 46983.76508117437, 47057.76471117623, 47144.05711885743, 47272.290915636295, 47456.0, 1201.0271679939276, 1206.5735398621498, 1214.9453274602488, 1218.1899037140379, 1222.10175520992, 24180.637290440307, 24873.502529949663, 24930.501389971738, 24986.875065624554, 25000.499989999735, 40127.1974560513, 40305.1938961225, 40335.3949690749, 40402.39396409115, 40838.387424189255, 241061.0, 242808.0, 244087.0, 244552.0, 245515.0, 28004.43991120207, 36407.271854562234, 38239.23521529498, 38332.23335533218, 38355.0, 36255.63744362522, 36873.63126368702, 37098.62901370952, 37504.81247593745, 37587.248255035294, 29744.702552974195, 31263.374732505676, 31596.842015789774, 31597.8420107898, 31598.526022110145, 30620.540691889193, 30878.0, 30916.381672366875, 30937.535936961413, 30948.0715578533, 34285.48571771475, 34435.311293773484, 34650.65349346474, 34914.0, 34917.825410872785, 29655.85172074126, 32188.356232875678, 32483.35033299368, 32750.34499310048, 35083.64916350804, 26473.205803825917, 26498.867505662347, 26713.866430667724, 26925.865370673022, 27013.45973080488], "prototype.html": [268.44833866404554, 276.98485052283377, 281.3570990287193, 284.0894931743762, 288.80505658680386, 5167.922481162776, 5325.573954083674, 5434.375046869611, 5441.619086663935, 5466.125419932811, 5303.204519322104, 5382.461753824616, 5395.59533035022, 5408.810691625794, 5415.377231618365, 4129.318662420697, 4135.627793498585, 4137.8965525861795, 4138.213739389514, 4163.292240319138, 4102.3436250199975, 4121.423000779893, 4121.732087414309, 4140.399642051916, 4176.7076304658685, 4094.2016306820183, 4098.877033688994, 4156.875293741193, 4157.8544750933725, 4159.355299928516, 3985.20295940813, 4052.331365324718, 4058.147788964321, 4067.5932406759384, 4130.793460326971, 3464.9826750866087, 3476.9304613907834, 3479.1476088358513, 3484.372812893678, 3493.4410494320787, 5211.166213405875, 5228.2680424740565, 5230.241614965847, 5235.345581802275, 5240.842774716764, 4562.156001139767, 4570.428696412949, 4588.609968152711, 4596.862094137181, 4609.516000819899, 5394.676319420808, 5491.862703432406, 5515.972420137874, 5660.943390566083, 5664.745086471119, 3750.9062273443383, 3751.249750050001, 3753.042974041602, 3764.7741135531683, 3775.131719704456, 5814.040683287252, 5845.006348920651, 5866.648001119904, 5879.088741245114, 5879.853003674943, 3705.8332375043187, 3707.3141468828353, 3712.7586706863967, 3720.534933133358, 3730.216654502585, 3780.527434070741, 3792.469054332396, 3832.1760821423527, 3841.769493830379, 3925.1364699766004, 4572.51988541205, 4586.128635559233, 4597.034622729264, 4626.074785042938, 4634.142683603544, 5642.069058605284, 5648.802291919763, 5686.459786320293, 5693.316801983706, 5705.058665320175, 1398.2100113435877, 1407.8944079194102, 1412.1668215752754, 1412.7315809996069, 1417.5322143692556, 857.4640849469082, 882.4925667741074, 884.6770928611139, 892.2683399612386, 906.5965645287783, 5469.56243500519, 5491.505764481216, 5500.0, 5517.0, 5521.033819081645, 5916.9645312070215, 5929.73316200772, 5942.078977758454, 5971.0744834550715, 5972.790952316735, 5457.290552228185, 5484.232207490954, 5497.39528651848, 5513.2005859150195, 5521.503064724194, 3199.568058312145, 3260.2990357073345, 3285.3100848822014, 3290.753193510496, 3294.011796461052, 6083.026715725463, 6103.298120716086, 6124.173236613, 6141.201643786279, 6165.136880836686, 6058.212432383762, 6059.878802423927, 6067.302260240129, 6085.361037091042, 6102.755889764359, 5964.850878728066, 6077.088436734525, 6081.361457046946, 6088.330283668793, 6112.327643959161, 5678.4605462480995, 5899.616524925866, 5904.822855314175, 5905.52755779528, 5909.8227053188475, 5624.100143976944, 5670.121131224667, 5705.686187259741, 5729.512991395778, 5773.7979170730505, 5951.702414879325, 6049.274087109575, 6051.122587224916, 6061.545384096298, 6064.575479716377, 3785.2051069275763, 3843.885273270832, 3855.6722678572637, 3862.942055869108, 3863.4398012288625, 5777.7977770777825, 5862.912056319244, 5865.032269675456, 5869.4717475427415, 5890.970545147418, 5703.543716502752, 5708.086706127, 5708.771649133988, 5734.082546792493, 5737.770489180386, 5720.39935806751, 5723.42765723441, 5734.197212390185, 5735.197072409783, 5742.425757424224, 5495.53287970527, 5591.077472217039, 5603.915941260966, 5605.4114317997655, 5619.494245517923, 5677.403872593318, 5703.0, 5707.0, 5712.514436272963, 5744.224529688438, 5594.38461769197, 5602.13166959122, 5616.775328986795, 5626.043572592587, 5627.465390787868], "yui.html": [646.1341801985338, 648.9935100648992, 667.4226793823339, 672.3175976383972, 678.304737643915, 11991.700207494818, 12076.879231207686, 12155.453004614792, 12158.635240942775, 12490.937545312283, 11669.824952625697, 11721.648350549476, 11757.70605734857, 11764.294142351466, 11768.588099416522, 613.1569092497815, 769.7152053740097, 774.2760518914832, 774.9847699513628, 775.9806004849868, 581.238577463522, 779.76996785948, 784.5136015670292, 797.5374282915924, 800.8678568036268, 809.2837838512929, 829.5852073963018, 834.2991886815105, 835.9122292159327, 839.5969934431477, 823.4112609484248, 825.335604838105, 826.1408135539032, 826.5825757992205, 826.5990994367727, 606.4420732925674, 611.1596554737237, 611.7308384310888, 611.9479844213247, 612.3539665652735, 11731.76536469266, 11767.235129716626, 11776.70558236051, 11796.056315494825, 11843.28940263587, 9931.50342482873, 10186.337888037328, 10363.378197308186, 10575.947120264427, 10576.418296993663, 7705.8844117338285, 7768.53388796674, 7778.338841198505, 7848.097468791105, 8079.555624440653, 2620.882060307291, 2626.2252635472582, 2667.2398366465463, 2685.5300322443495, 2693.3493085914765, 39760.40359394612, 40023.0, 40088.0, 40209.19581608351, 40616.187676246605, 5977.880442391215, 6164.599301045418, 6174.166487524217, 6184.103305020747, 6212.627242365382, 10200.642977495752, 10208.795824083476, 10225.386476811414, 10266.384016959006, 10293.485325733684, 5024.171011783088, 5059.87350316245, 5110.821121260738, 5300.257963885059, 5304.0, 3214.13218431027, 3219.0825614700166, 3316.966830331714, 3343.749218808599, 3364.158960259935, 2305.2392710405525, 2331.2306938710185, 2333.2183718454166, 2342.133410638041, 2346.636271377939, 349.81809459081643, 353.0397319291523, 353.31809607457853, 353.6799196726966, 354.52670684636297, 396.0791160551671, 469.47418890841794, 496.9950300496949, 519.649236765182, 523.8140460136673, 6413.583117097373, 6840.589564626139, 7161.749338773118, 7321.121465424077, 7365.226651201654, 407.1104636369542, 498.32228169689193, 519.4831143012726, 530.3423754544415, 552.8258598541527, 3137.743035674258, 3181.141091905219, 3211.6306624737986, 3218.5976752905885, 3274.9017529474154, 50417.49582504202, 50790.49209507932, 50988.49011509911, 51202.74398627983, 51236.74381628068, 41667.58332416637, 42758.358624620654, 42847.785761071, 42858.35712464315, 42907.0, 41091.38362924558, 41902.79048604737, 42363.57636423596, 42754.0, 43018.13963720708, 7001.579905205704, 7195.82010449722, 7259.564426134449, 7264.34620884123, 7297.963510182415, 30973.845130774203, 31347.0, 32251.677483225805, 32364.35271294514, 32370.190745231557, 38365.61634383732, 38398.42402363911, 39763.80118099391, 42299.154016918874, 42688.57311426846, 6464.4828413725845, 6542.378474044958, 6690.732370705312, 6729.92321228601, 6762.763303284558, 9431.104045115702, 9665.178459830993, 9734.513274336114, 9762.951185244028, 10173.338732982333, 9106.499142547224, 9236.907630923604, 9251.398659087406, 9335.906640933505, 9836.655717049869, 8817.426867253607, 8834.867476987978, 9165.519904166988, 9370.156685898302, 9578.90421095808, 8570.800747110918, 8837.140019860974, 9034.503102329434, 9057.72678021298, 9376.859347109663, 7748.147703752696, 7775.416843736855, 7877.84244315099, 7879.724209652634, 8385.245327920273, 6982.406495447944, 7290.270972902667, 7344.228855970046, 7392.303848075962, 8121.4721043132]}, "summary": {"lowerIsBetter": false, "suite": 5809.9676194627045, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 5670.146072152384, "unit": "ms", "value": 5670.146072152384}, "dojo.html": {"lowerIsBetter": false, "filtered": 4823.23038868976, "unit": "ms", "value": 4823.23038868976}, "mootools.html": {"lowerIsBetter": false, "filtered": 3989.464792208049, "unit": "ms", "value": 3989.464792208049}, "ext.html": {"lowerIsBetter": false, "filtered": 16343.01598759004, "unit": "ms", "value": 16343.01598759004}, "prototype.html": {"lowerIsBetter": false, "filtered": 4240.920575297046, "unit": "ms", "value": 4240.920575297046}, "yui.html": {"lowerIsBetter": false, "filtered": 5085.828131950271, "unit": "ms", "value": 5085.828131950271}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0018.e"}, "testrun": {"date": 1447263241, "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": "20151111072232", "branch": "Fx-Team", "revision": "db82f47b94a2aaf03968870c936452d38820bcf8"}}, {"talos_counters": {}, "results": {"audio-dft": [190.0, 193.0, 203.0, 195.0, 194.0, 194.0, 191.0, 185.0, 198.0, 195.0], "ai-astar": [129.0, 118.0, 127.0, 128.0, 129.0, 140.0, 127.0, 129.0, 127.0, 127.0], "imaging-gaussian-blur": [144.0, 136.0, 143.0, 143.0, 144.0, 144.0, 137.0, 140.0, 147.0, 136.0], "audio-beat-detection": [178.0, 156.0, 181.0, 193.0, 151.0, 173.0, 171.0, 156.0, 187.0, 158.0], "json-stringify-tinderbox": [77.0, 81.0, 81.0, 82.0, 80.0, 81.0, 81.0, 81.0, 81.0, 82.0], "stanford-crypto-pbkdf2": [183.0, 188.0, 189.0, 183.0, 188.0, 170.0, 185.0, 177.0, 183.0, 168.0], "json-parse-financial": [70.0, 72.0, 74.0, 75.0, 76.0, 74.0, 76.0, 84.0, 76.0, 74.0], "stanford-crypto-sha256-iterative": [80.0, 84.0, 83.0, 88.0, 87.0, 87.0, 87.0, 87.0, 85.0, 86.0], "audio-fft": [81.0, 87.0, 96.0, 136.0, 83.0, 83.0, 82.0, 82.0, 134.0, 81.0], "imaging-darkroom": [157.0, 149.0, 150.0, 149.0, 149.0, 150.0, 150.0, 150.0, 150.0, 156.0], "stanford-crypto-ccm": [149.0, 157.0, 154.0, 156.0, 149.0, 160.0, 159.0, 147.0, 148.0, 150.0], "audio-oscillator": [101.0, 104.0, 150.0, 102.0, 105.0, 104.0, 146.0, 103.0, 105.0, 148.0], "stanford-crypto-aes": [104.0, 103.0, 111.0, 107.0, 103.0, 103.0, 108.0, 104.0, 104.0, 104.0], "imaging-desaturate": [122.0, 128.0, 124.0, 121.0, 122.0, 122.0, 127.0, 123.0, 122.0, 121.0]}, "summary": {"lowerIsBetter": true, "suite": 1799.8, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 94.5, "unit": "ms", "value": 94.5}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 181.4, "unit": "ms", "value": 181.4}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 170.4, "unit": "ms", "value": 170.4}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 152.9, "unit": "ms", "value": 152.9}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 151.0, "unit": "ms", "value": 151.0}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 75.1, "unit": "ms", "value": 75.1}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 116.8, "unit": "ms", "value": 116.8}, "ai-astar": {"lowerIsBetter": true, "filtered": 128.1, "unit": "ms", "value": 128.1}, "audio-dft": {"lowerIsBetter": true, "filtered": 193.8, "unit": "ms", "value": 193.8}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 85.4, "unit": "ms", "value": 85.4}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 80.7, "unit": "ms", "value": 80.7}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 141.4, "unit": "ms", "value": 141.4}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 105.1, "unit": "ms", "value": 105.1}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 123.2, "unit": "ms", "value": 123.2}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0018.e"}, "testrun": {"date": 1447263241, "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": "20151111072232", "branch": "Fx-Team", "revision": "db82f47b94a2aaf03968870c936452d38820bcf8"}}, {"talos_counters": {}, "results": {"DeltaBlue": [225.93764121102575], "Encrypt": [367.37692872887584], "NavierStokes": [6519.480519480519], "Decrypt": [6635.761589403974], "Splay": [747.3841554559043], "Richards": [852.5149190110827], "RegExp": [32725.8064516129], "Earley": [893.6550491510277], "Boyer": [14623.188405797102], "RayTrace": [1295.3367875647668]}, "summary": {"lowerIsBetter": false, "suite": 14791.799367126165, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 292.63826800000004, "unit": "score", "value": 292.63826800000004}, "Encrypt": {"lowerIsBetter": false, "filtered": 724.5446820000001, "unit": "score", "value": 724.5446820000001}, "NavierStokes": {"lowerIsBetter": false, "filtered": 227.6254980079681, "unit": "score", "value": 227.6254980079681}, "Decrypt": {"lowerIsBetter": false, "filtered": 40.11310479041916, "unit": "score", "value": 40.11310479041916}, "Splay": {"lowerIsBetter": false, "filtered": 109.03495800000003, "unit": "score", "value": 109.03495800000003}, "RegExp": {"lowerIsBetter": false, "filtered": 27.83689995071465, "unit": "score", "value": 27.83689995071465}, "Richards": {"lowerIsBetter": false, "filtered": 41.40924600000002, "unit": "score", "value": 41.40924600000002}, "Earley": {"lowerIsBetter": false, "filtered": 745.772097, "unit": "score", "value": 745.772097}, "Boyer": {"lowerIsBetter": false, "filtered": 45.57576511397421, "unit": "score", "value": 45.57576511397421}, "RayTrace": {"lowerIsBetter": false, "filtered": 571.2715079999999, "unit": "score", "value": 571.2715079999999}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0018.e"}, "testrun": {"date": 1447263241, "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": "20151111072232", "branch": "Fx-Team", "revision": "db82f47b94a2aaf03968870c936452d38820bcf8"}}] 09:54:17 INFO - RETURN: dromaeo_css: 5809.97 09:54:17 INFO - RETURN: kraken: 1799.80 09:54:17 INFO - RETURN: v8_7: 14791.80 09:54:17 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,57]]", "result": "14791.80"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,57]]", "result": "1799.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,57]]", "result": "5809.97"}}} 09:54:17 INFO - Return code: 0 09:54:17 INFO - # TBPL SUCCESS # 09:54:17 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 09:54:17 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 09:54:17 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 09:54:17 INFO - 2015-11-11 09:54:17.784 screenresolution[2233:20542] starting screenresolution argv=screenresolution get 09:54:17 INFO - 2015-11-11 09:54:17.788 screenresolution[2233:20542] Display 0: 1600x1200x32@60 09:54:17 INFO - 2015-11-11 09:54:17.794 screenresolution[2234:20546] starting screenresolution argv=screenresolution list 09:54:17 INFO - Available Modes on Display 0 09:54:17 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 09:54:17 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 09:54:17 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 09:54:17 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 09:54:18 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 09:54:18 INFO - Intel HD Graphics 3000: 09:54:18 INFO - Chipset Model: Intel HD Graphics 3000 09:54:18 INFO - Type: GPU 09:54:18 INFO - Bus: Built-In 09:54:18 INFO - VRAM (Total): 512 MB 09:54:18 INFO - VRAM (Dynamic, Max): 10 09:54:18 INFO - Vendor: Intel (0x8086) 09:54:18 INFO - Device ID: 0x0116 09:54:18 INFO - Revision ID: 0x0009 09:54:18 INFO - Displays: 09:54:18 INFO - Display: 09:54:18 INFO - Resolution: 1600 x 1200 @ 60 Hz 09:54:18 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 09:54:18 INFO - Display Serial Number: 1600x1200 60 09:54:18 INFO - Main Display: Yes 09:54:18 INFO - Mirror: Off 09:54:18 INFO - Online: Yes 09:54:18 INFO - Rotation: Supported 09:54:18 INFO - Return code: 0 09:54:18 INFO - Running post-action listener: _resource_record_post_action 09:54:18 INFO - Running post-run listener: _resource_record_post_run 09:54:19 INFO - Total resource usage - Wall time: 1257s; CPU: 30.0%; Read bytes: 2539520; Write bytes: 692494336; Read time: 882; Write time: 81229 09:54:19 INFO - install - Wall time: 41s; CPU: 30.0%; Read bytes: 336495104; Write bytes: 338223104; Read time: 34963; Write time: 8046 09:54:19 INFO - run-tests - Wall time: 1217s; CPU: 30.0%; Read bytes: 2539520; Write bytes: 343920640; Read time: 882; Write time: 71967 09:54:19 INFO - Running post-run listener: _upload_blobber_files 09:54:19 INFO - Blob upload gear active. 09:54:19 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 09:54:19 INFO - Copying logs to upload dir... 09:54:19 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=2603.685895 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 43 mins, 23 secs) (at 2015-11-11 09:54:19.230591) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-11 09:54:19.234154) ========= 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.Tk61uT9sXx/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.4catTHUZol/Listeners TMPDIR=/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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/SdaCC33NTd2S4BDRt9ohGQ/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010919 build_url: 'https://queue.taskcluster.net/v1/task/SdaCC33NTd2S4BDRt9ohGQ/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-11 09:54:19.262181) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:54:19.262551) ========= 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.Tk61uT9sXx/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.4catTHUZol/Listeners TMPDIR=/var/folders/h_/qm_0_8l16mx72zdxd4g30gd800000w/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.005952 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 09:54:19.315342) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-11 09:54:19.315962) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-11 09:54:19.316685) ========= ========= Total master_lag: 0.25 =========