builder: fx-team_yosemite_test-dromaeojs-e10s slave: t-yosemite-r5-0040 starttime: 1447292454.47 results: success (0) buildid: 20151111160710 builduid: 069fc34eaae240a291ead187e23063df revision: e4d573fb1fc1864531bc84c1a57ce61b79b9c076 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.471862) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.472422) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.473051) ========= 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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners TMPDIR=/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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.006815 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.500508) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.500957) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.518199) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.518788) ========= 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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners TMPDIR=/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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.005733 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.569953) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.570408) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.570949) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.571436) ========= 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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners TMPDIR=/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:40: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% 7.52M=0.002s 2015-11-11 17:40:54 (7.52 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.181114 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.772307) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.772854) ========= 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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners TMPDIR=/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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.021676 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.822974) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:54.823406) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev e4d573fb1fc1864531bc84c1a57ce61b79b9c076 --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 e4d573fb1fc1864531bc84c1a57ce61b79b9c076 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.9OGnLYvyPW/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.jRgd2NIRPt/Listeners TMPDIR=/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:40:54,906 truncating revision to first 12 chars 2015-11-11 17:40:54,907 Setting DEBUG logging. 2015-11-11 17:40:54,907 attempt 1/10 2015-11-11 17:40:54,907 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/e4d573fb1fc1?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-11 17:40:55,165 unpacking tar archive at: fx-team-e4d573fb1fc1/testing/mozharness/ program finished with exit code 0 elapsedTime=0.528608 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:55.373285) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:55.373909) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:55.389445) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:55.390068) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 17:40:55.391011) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 23 mins, 13 secs) (at 2015-11-11 17:40:55.391765) ========= /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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners TMPDIR=/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:40:55 INFO - MultiFileLogger online at 20151111 17:40:55 in /builds/slave/test 17:40: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 17:40:55 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:40:55 INFO - {'append_to_log': False, 17:40:55 INFO - 'base_work_dir': '/builds/slave/test', 17:40:55 INFO - 'blob_upload_branch': 'Fx-Team', 17:40:55 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:40:55 INFO - 'branch': 'Fx-Team', 17:40:55 INFO - 'buildbot_json_path': 'buildprops.json', 17:40:55 INFO - 'config_files': ('talos/mac_config.py',), 17:40:55 INFO - 'default_actions': ('clobber', 17:40:55 INFO - 'read-buildbot-config', 17:40:55 INFO - 'download-and-extract', 17:40:55 INFO - 'populate-webroot', 17:40:55 INFO - 'create-virtualenv', 17:40:55 INFO - 'install', 17:40:55 INFO - 'run-tests'), 17:40:55 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:40:55 INFO - 'download_minidump_stackwalk': True, 17:40:55 INFO - 'download_symbols': 'ondemand', 17:40:55 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:40:55 INFO - 'tooltool.py': '/tools/tooltool.py', 17:40:55 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:40:55 INFO - '/tools/misc-python/virtualenv.py')}, 17:40:55 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:40:55 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:40:55 INFO - 'installer_path': 'installer.exe', 17:40:55 INFO - 'log_level': 'info', 17:40:55 INFO - 'log_name': 'talos', 17:40:55 INFO - 'log_to_console': True, 17:40:55 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 17:40:55 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 17:40:55 INFO - 'opt_config_files': (), 17:40:55 INFO - 'pip_index': False, 17:40:55 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:40:55 INFO - 'cmd': ('bash', 17:40:55 INFO - '-c', 17:40:55 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:40:55 INFO - 'enabled': True, 17:40:55 INFO - 'halt_on_failure': False, 17:40:55 INFO - 'name': 'check_screen_resolution'},), 17:40:55 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:40:55 INFO - 'cmd': ('bash', 17:40:55 INFO - '-c', 17:40:55 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:40:55 INFO - 'enabled': True, 17:40:55 INFO - 'halt_on_failure': False, 17:40:55 INFO - 'name': 'check_screen_resolution'},), 17:40:55 INFO - 'run_cmd_checks_enabled': True, 17:40:55 INFO - 'sps_profile': False, 17:40:55 INFO - 'sps_profile_interval': 0, 17:40:55 INFO - 'suite': 'dromaeojs-e10s', 17:40:55 INFO - 'system_bits': '64', 17:40:55 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:40:55 INFO - 'title': 't-yosemite-r5-0040', 17:40:55 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:40:55 INFO - 'use_talos_json': True, 17:40:55 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:40:55 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:40:55 INFO - 'work_dir': 'build'} 17:40:55 INFO - ##### 17:40:55 INFO - ##### Running clobber step. 17:40:55 INFO - ##### 17:40:55 INFO - Running pre-action listener: _resource_record_pre_action 17:40:55 INFO - Running main action method: clobber 17:40:55 INFO - rmtree: /builds/slave/test/build 17:40:55 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:40:55 INFO - Running post-action listener: _resource_record_post_action 17:40:55 INFO - ##### 17:40:55 INFO - ##### Running read-buildbot-config step. 17:40:55 INFO - ##### 17:40:55 INFO - Running pre-action listener: _resource_record_pre_action 17:40:55 INFO - Running main action method: read_buildbot_config 17:40:55 INFO - Using buildbot properties: 17:40:55 INFO - { 17:40:55 INFO - "properties": { 17:40:55 INFO - "buildnumber": 46, 17:40:55 INFO - "product": "firefox", 17:40:55 INFO - "script_repo_revision": "production", 17:40:55 INFO - "builddir": "fx-team_yosemite_test-dromaeojs-e10s", 17:40:55 INFO - "repository": "", 17:40:55 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 fx-team talos dromaeojs-e10s", 17:40:55 INFO - "buildid": "20151111160710", 17:40:55 INFO - "slavename": "t-yosemite-r5-0040", 17:40:55 INFO - "pgo_build": "False", 17:40:55 INFO - "basedir": "/builds/slave/test", 17:40:55 INFO - "project": "", 17:40:55 INFO - "platform": "yosemite", 17:40:55 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 17:40:55 INFO - "slavebuilddir": "test", 17:40:55 INFO - "scheduler": "tests-fx-team-macosx64-talos", 17:40:55 INFO - "branch": "fx-team", 17:40:55 INFO - "repo_path": "integration/fx-team", 17:40:55 INFO - "stage_platform": "macosx64", 17:40:55 INFO - "builduid": "069fc34eaae240a291ead187e23063df", 17:40:55 INFO - "revision": "e4d573fb1fc1864531bc84c1a57ce61b79b9c076" 17:40:55 INFO - }, 17:40:55 INFO - "sourcestamp": { 17:40:55 INFO - "repository": "", 17:40:55 INFO - "hasPatch": false, 17:40:55 INFO - "project": "", 17:40:55 INFO - "branch": "fx-team-macosx64-talos", 17:40:55 INFO - "changes": [ 17:40:55 INFO - { 17:40:55 INFO - "category": null, 17:40:55 INFO - "files": [ 17:40:55 INFO - { 17:40:55 INFO - "url": null, 17:40:55 INFO - "name": "https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 17:40:55 INFO - } 17:40:55 INFO - ], 17:40:55 INFO - "repository": "", 17:40:55 INFO - "rev": "e4d573fb1fc1864531bc84c1a57ce61b79b9c076", 17:40:55 INFO - "who": "jsantell@mozilla.com", 17:40:55 INFO - "when": 1447292224, 17:40:55 INFO - "number": 6651395, 17:40:55 INFO - "comments": "Bug 1215953 - Add feature for importing heap snapshots into the memory\ntool. r=fitzgen,ntim\n", 17:40:55 INFO - "project": "", 17:40:55 INFO - "at": "Wed 11 Nov 2015 17:37:04", 17:40:55 INFO - "branch": "fx-team-macosx64-talos", 17:40:55 INFO - "revlink": "", 17:40:55 INFO - "properties": [ 17:40:55 INFO - [ 17:40:55 INFO - "buildid", 17:40:55 INFO - "20151111160710", 17:40:55 INFO - "Change" 17:40:55 INFO - ], 17:40:55 INFO - [ 17:40:55 INFO - "builduid", 17:40:55 INFO - "069fc34eaae240a291ead187e23063df", 17:40:55 INFO - "Change" 17:40:55 INFO - ], 17:40:55 INFO - [ 17:40:55 INFO - "pgo_build", 17:40:55 INFO - "False", 17:40:55 INFO - "Change" 17:40:55 INFO - ] 17:40:55 INFO - ], 17:40:55 INFO - "revision": "e4d573fb1fc1864531bc84c1a57ce61b79b9c076" 17:40:55 INFO - } 17:40:55 INFO - ], 17:40:55 INFO - "revision": "e4d573fb1fc1864531bc84c1a57ce61b79b9c076" 17:40:55 INFO - } 17:40:55 INFO - } 17:40:55 INFO - Found installer url https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 17:40:55 INFO - Running post-action listener: _resource_record_post_action 17:40:55 INFO - ##### 17:40:55 INFO - ##### Running download-and-extract step. 17:40:55 INFO - ##### 17:40:55 INFO - Running pre-action listener: _resource_record_pre_action 17:40:55 INFO - Running main action method: download_and_extract 17:40:55 INFO - mkdir: /builds/slave/test/build/tests 17:40: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')]} 17:40:55 INFO - https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 17:40:55 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/test_packages.json 17:40:55 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/test_packages.json 17:40:55 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 17:40:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 17:40:56 INFO - Downloaded 1149 bytes. 17:40:56 INFO - Reading from file /builds/slave/test/build/test_packages.json 17:40:56 INFO - Using the following test package requirements: 17:40:56 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 17:40:56 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 17:40:56 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 17:40:56 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 17:40:56 INFO - u'jsshell-mac.zip'], 17:40:56 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 17:40:56 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 17:40:56 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 17:40:56 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 17:40:56 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 17:40:56 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 17:40:56 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 17:40:56 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 17:40:56 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 17:40:56 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 17:40:56 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 17:40:56 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 17:40:56 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 17:40:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:40:56 INFO - https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 17:40:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 17:40:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 17:40:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/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 17:40:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/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 17:40:57 INFO - Downloaded 17453985 bytes. 17:40:57 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 17:40:57 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 17:40:57 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 17:41:02 INFO - Return code: 0 17:41:02 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 17:41: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')]} 17:41:02 INFO - https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 17:41:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 17:41:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 17:41:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/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 17:41:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/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 17:41:04 INFO - Downloaded 17453985 bytes. 17:41:04 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 17:41:04 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 17:41:04 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 17:41:10 INFO - Return code: 0 17:41:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:10 INFO - https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 17:41:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 17:41:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 17:41:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/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 17:41:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/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 17:41:11 INFO - Downloaded 11131693 bytes. 17:41:11 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 17:41:11 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 17:41:11 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 17:41:11 INFO - Return code: 0 17:41:11 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')]} 17:41:11 INFO - https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 17:41:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 17:41:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 17:41:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 17:41:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/evpTvts3Q3uwn9oc9nPC2Q/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 17:41:15 INFO - Downloaded 108710284 bytes. 17:41:15 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 17:41:15 INFO - mkdir: /builds/slave/test/properties 17:41:15 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:41:15 INFO - Writing to file /builds/slave/test/properties/build_url 17:41:15 INFO - Contents: 17:41:15 INFO - build_url:https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 17:41:15 INFO - Running post-action listener: _resource_record_post_action 17:41:15 INFO - Running post-action listener: set_extra_try_arguments 17:41:15 INFO - ##### 17:41:15 INFO - ##### Running populate-webroot step. 17:41:15 INFO - ##### 17:41:15 INFO - Running pre-action listener: _resource_record_pre_action 17:41:15 INFO - Running main action method: populate_webroot 17:41:15 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:41:15 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:41:15 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 17:41:15 INFO - '../fennec_ids.txt'], 17:41:15 INFO - 'tests': ['tcheck2']}, 17:41:15 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:41:15 INFO - '--tppagecycles', 17:41:15 INFO - '7'], 17:41:15 INFO - 'tests': ['tsvgm']}}, 17:41:15 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 17:41:15 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:41:15 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 17:41:15 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 17:41:15 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:41:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:41:15 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:41:15 INFO - 'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:41:15 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:41:15 INFO - 'tests': ['damp', 'tps']}, 17:41:15 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:41:15 INFO - 'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['damp', 'tps']}, 17:41:15 INFO - 'g3': {'tests': ['dromaeo_dom']}, 17:41:15 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:41:15 INFO - 'other': {'tests': ['a11yr', 17:41:15 INFO - 'ts_paint', 17:41:15 INFO - 'tpaint', 17:41:15 INFO - 'sessionrestore', 17:41:15 INFO - 'sessionrestore_no_auto_restore']}, 17:41:15 INFO - 'other-e10s': {'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['a11yr', 17:41:15 INFO - 'ts_paint', 17:41:15 INFO - 'tpaint', 17:41:15 INFO - 'sessionrestore', 17:41:15 INFO - 'sessionrestore_no_auto_restore']}, 17:41:15 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['a11yr', 17:41:15 INFO - 'ts_paint', 17:41:15 INFO - 'tpaint', 17:41:15 INFO - 'sessionrestore', 17:41:15 INFO - 'sessionrestore_no_auto_restore']}, 17:41:15 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['a11yr', 17:41:15 INFO - 'ts_paint', 17:41:15 INFO - 'tpaint', 17:41:15 INFO - 'sessionrestore', 17:41:15 INFO - 'sessionrestore_no_auto_restore']}, 17:41:15 INFO - 'other_l64': {'tests': ['a11yr', 17:41:15 INFO - 'ts_paint', 17:41:15 INFO - 'tpaint', 17:41:15 INFO - 'sessionrestore', 17:41:15 INFO - 'sessionrestore_no_auto_restore']}, 17:41:15 INFO - 'other_nol64': {'tests': ['a11yr', 17:41:15 INFO - 'ts_paint', 17:41:15 INFO - 'tpaint', 17:41:15 INFO - 'sessionrestore', 17:41:15 INFO - 'sessionrestore_no_auto_restore']}, 17:41:15 INFO - 'svgr': {'tests': ['tsvgx', 17:41:15 INFO - 'tsvgr_opacity', 17:41:15 INFO - 'tart', 17:41:15 INFO - 'tscrollx', 17:41:15 INFO - 'cart']}, 17:41:15 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['tsvgx', 17:41:15 INFO - 'tsvgr_opacity', 17:41:15 INFO - 'tart', 17:41:15 INFO - 'tscrollx', 17:41:15 INFO - 'cart']}, 17:41:15 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:41:15 INFO - 'tests': ['tp5o']}, 17:41:15 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:41:15 INFO - 'talos_options': ['--e10s'], 17:41:15 INFO - 'tests': ['tp5o']}, 17:41:15 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:41:15 INFO - 'talos_options': ['--xperf_path', 17:41:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:41:15 INFO - 'tests': ['tp5n']}, 17:41:15 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:41:15 INFO - 'talos_options': ['--e10s', 17:41:15 INFO - '--xperf_path', 17:41:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:41:15 INFO - 'tests': ['tp5n']}}, 17:41:15 INFO - 'talos.zip': {'path': '', 17:41:15 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:41:15 INFO - Running post-action listener: _resource_record_post_action 17:41:15 INFO - ##### 17:41:15 INFO - ##### Running create-virtualenv step. 17:41:15 INFO - ##### 17:41:15 INFO - Running pre-action listener: _resource_record_pre_action 17:41:15 INFO - Running main action method: create_virtualenv 17:41:15 INFO - Creating virtualenv /builds/slave/test/build/venv 17:41:15 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 17:41:15 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:41:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:41:15 INFO - Using real prefix '/tools/python27' 17:41:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:41:16 INFO - Installing distribute.............................................................................................................................................................................................done. 17:41:20 INFO - Installing pip.................done. 17:41:20 INFO - Return code: 0 17:41:20 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:41:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:41:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:41:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:20 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 0x10aa14490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9f1228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f818a64a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9379f0>, '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 0x10a697db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a92b8c8>, '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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:41:20 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 17:41:20 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 17:41:20 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.9OGnLYvyPW/Render', 17:41:20 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:41:20 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:41:20 INFO - 'HOME': '/Users/cltbld', 17:41:20 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:41:20 INFO - 'LOGNAME': 'cltbld', 17:41:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:41:20 INFO - 'MOZ_NO_REMOTE': '1', 17:41:20 INFO - 'NO_EM_RESTART': '1', 17:41:20 INFO - 'PAGER': '/bin/cat', 17:41:20 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:41:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:41:20 INFO - 'PWD': '/builds/slave/test', 17:41:20 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:41:20 INFO - 'SHELL': '/bin/bash', 17:41:20 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.jRgd2NIRPt/Listeners', 17:41:20 INFO - 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/', 17:41:20 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:41:20 INFO - 'USER': 'cltbld', 17:41:20 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:41:20 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:41:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:41:20 INFO - 'XPC_FLAGS': '0x0', 17:41:20 INFO - 'XPC_SERVICE_NAME': '0', 17:41:20 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 17:41:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:41:20 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 17:41:20 INFO - Cleaning up... 17:41:20 INFO - Return code: 0 17:41:20 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 17:41:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:41:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:41:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:20 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 0x10aa14490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9f1228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f818a64a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9379f0>, '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 0x10a697db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a92b8c8>, '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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:41:20 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 17:41:20 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 17:41:20 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.9OGnLYvyPW/Render', 17:41:20 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:41:20 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:41:20 INFO - 'HOME': '/Users/cltbld', 17:41:20 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:41:20 INFO - 'LOGNAME': 'cltbld', 17:41:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:41:20 INFO - 'MOZ_NO_REMOTE': '1', 17:41:20 INFO - 'NO_EM_RESTART': '1', 17:41:20 INFO - 'PAGER': '/bin/cat', 17:41:20 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:41:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:41:20 INFO - 'PWD': '/builds/slave/test', 17:41:20 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:41:20 INFO - 'SHELL': '/bin/bash', 17:41:20 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.jRgd2NIRPt/Listeners', 17:41:20 INFO - 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/', 17:41:20 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:41:20 INFO - 'USER': 'cltbld', 17:41:20 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:41:20 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:41:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:41:20 INFO - 'XPC_FLAGS': '0x0', 17:41:20 INFO - 'XPC_SERVICE_NAME': '0', 17:41:20 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 17:41:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:41:20 INFO - Downloading/unpacking psutil>=0.7.1 17:41:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:41:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:41:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:41:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:41:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:41:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:41:23 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 17:41:23 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 17:41:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:41:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:41:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:41:23 INFO - Installing collected packages: psutil 17:41:23 INFO - Running setup.py install for psutil 17:41:23 INFO - building 'psutil._psutil_osx' extension 17:41:23 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 17:41:24 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 17:41:24 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 17:41:24 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 17:41:24 INFO - building 'psutil._psutil_posix' extension 17:41:24 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 17:41:24 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 17:41:24 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 17:41:24 INFO - ^ 17:41:24 INFO - 1 warning generated. 17:41:24 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 17:41:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:41:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:41:24 INFO - Successfully installed psutil 17:41:24 INFO - Cleaning up... 17:41:24 INFO - Return code: 0 17:41:24 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 17:41:24 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')]} 17:41:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:41:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:24 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')]} 17:41:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:41:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:24 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 0x10aa14490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9f1228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f818a64a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9379f0>, '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 0x10a697db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a92b8c8>, '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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:41:24 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 17:41:24 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 17:41:24 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.9OGnLYvyPW/Render', 17:41:24 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:41:24 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:41:24 INFO - 'HOME': '/Users/cltbld', 17:41:24 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:41:24 INFO - 'LOGNAME': 'cltbld', 17:41:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:41:24 INFO - 'MOZ_NO_REMOTE': '1', 17:41:24 INFO - 'NO_EM_RESTART': '1', 17:41:24 INFO - 'PAGER': '/bin/cat', 17:41:24 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:41:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:41:24 INFO - 'PWD': '/builds/slave/test', 17:41:24 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:41:24 INFO - 'SHELL': '/bin/bash', 17:41:24 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.jRgd2NIRPt/Listeners', 17:41:24 INFO - 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/', 17:41:24 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:41:24 INFO - 'USER': 'cltbld', 17:41:24 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:41:24 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:41:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:41:24 INFO - 'XPC_FLAGS': '0x0', 17:41:24 INFO - 'XPC_SERVICE_NAME': '0', 17:41:24 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 17:41:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:41:25 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 17:41:25 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 17:41:25 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 17:41:25 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 17:41:25 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 17:41:25 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 17:41:25 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 17:41:28 INFO - Downloading mozsystemmonitor-0.0.tar.gz 17:41:28 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 17:41:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:41:28 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 17:41:28 INFO - Installing collected packages: mozsystemmonitor 17:41:28 INFO - Running setup.py install for mozsystemmonitor 17:41:28 INFO - Successfully installed mozsystemmonitor 17:41:28 INFO - Cleaning up... 17:41:28 INFO - Return code: 0 17:41:28 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:41:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:41:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:41:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:28 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 0x10aa14490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9f1228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f818a64a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9379f0>, '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 0x10a697db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a92b8c8>, '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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:41:28 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 17:41:28 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 17:41:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.9OGnLYvyPW/Render', 17:41:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:41:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:41:28 INFO - 'HOME': '/Users/cltbld', 17:41:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:41:28 INFO - 'LOGNAME': 'cltbld', 17:41:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:41:28 INFO - 'MOZ_NO_REMOTE': '1', 17:41:28 INFO - 'NO_EM_RESTART': '1', 17:41:28 INFO - 'PAGER': '/bin/cat', 17:41:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:41:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:41:28 INFO - 'PWD': '/builds/slave/test', 17:41:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:41:28 INFO - 'SHELL': '/bin/bash', 17:41:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.jRgd2NIRPt/Listeners', 17:41:28 INFO - 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/', 17:41:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:41:28 INFO - 'USER': 'cltbld', 17:41:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:41:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:41:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:41:28 INFO - 'XPC_FLAGS': '0x0', 17:41:28 INFO - 'XPC_SERVICE_NAME': '0', 17:41:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 17:41:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:41:28 INFO - Downloading/unpacking blobuploader==1.2.4 17:41:28 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 17:41:28 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 17:41:28 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 17:41:28 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 17:41:28 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 17:41:28 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 17:41:31 INFO - Downloading blobuploader-1.2.4.tar.gz 17:41:31 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 17:41:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:41:31 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:41:31 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 17:41:31 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 17:41:31 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 17:41:31 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 17:41:31 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 17:41:31 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 17:41:32 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 17:41:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:41:32 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:41:32 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 17:41:32 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 17:41:32 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 17:41:32 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 17:41:32 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 17:41:32 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 17:41:33 INFO - Downloading docopt-0.6.1.tar.gz 17:41:33 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 17:41:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:41:33 INFO - Installing collected packages: blobuploader, requests, docopt 17:41:33 INFO - Running setup.py install for blobuploader 17:41:33 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:41:33 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:41:33 INFO - Running setup.py install for requests 17:41:34 INFO - Running setup.py install for docopt 17:41:34 INFO - Successfully installed blobuploader requests docopt 17:41:34 INFO - Cleaning up... 17:41:34 INFO - Return code: 0 17:41:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:41:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:41:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:41:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:41:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:34 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 0x10aa14490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9f1228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f818a64a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9379f0>, '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 0x10a697db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a92b8c8>, '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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:41:34 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 17:41:34 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 17:41:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.9OGnLYvyPW/Render', 17:41:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:41:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:41:34 INFO - 'HOME': '/Users/cltbld', 17:41:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:41:34 INFO - 'LOGNAME': 'cltbld', 17:41:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:41:34 INFO - 'MOZ_NO_REMOTE': '1', 17:41:34 INFO - 'NO_EM_RESTART': '1', 17:41:34 INFO - 'PAGER': '/bin/cat', 17:41:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:41:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:41:34 INFO - 'PWD': '/builds/slave/test', 17:41:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:41:34 INFO - 'SHELL': '/bin/bash', 17:41:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.jRgd2NIRPt/Listeners', 17:41:34 INFO - 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/', 17:41:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:41:34 INFO - 'USER': 'cltbld', 17:41:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:41:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:41:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:41:34 INFO - 'XPC_FLAGS': '0x0', 17:41:34 INFO - 'XPC_SERVICE_NAME': '0', 17:41:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 17:41:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:41:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:41:34 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-4NCWmh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:41:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:41:34 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-oWkDiE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:41:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:41:35 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-ZzvA2_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:41:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:41:35 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-W2d4oi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:41:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:41:35 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-tBTAiZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:41:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:41:35 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-o1VYSs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:41:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:41:35 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-7dXmJZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:41:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:41:35 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-f7I_xR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:41:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:41:35 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-4kti3s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:41:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:41:36 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-2Rj2Lc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:41:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:41:36 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-vrpKKY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:41:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:41:36 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-yiYKbl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:41:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:41:36 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-vby_6d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:41:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:41:36 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-qm3ifo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:41:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:41:36 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-aSNnOf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:41:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:41:36 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-QECcS5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:41:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:41:37 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-oIOLwN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:41:37 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:41:37 INFO - Running setup.py install for manifestparser 17:41:37 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:41:37 INFO - Running setup.py install for mozcrash 17:41:37 INFO - Running setup.py install for mozdebug 17:41:37 INFO - Running setup.py install for mozdevice 17:41:38 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 17:41:38 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:41:38 INFO - Running setup.py install for mozfile 17:41:38 INFO - Running setup.py install for mozhttpd 17:41:38 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:41:38 INFO - Running setup.py install for mozinfo 17:41:38 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:41:38 INFO - Running setup.py install for mozInstall 17:41:38 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:41:38 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:41:38 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:41:38 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:41:38 INFO - Running setup.py install for mozleak 17:41:39 INFO - Running setup.py install for mozlog 17:41:39 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:41:39 INFO - Running setup.py install for moznetwork 17:41:39 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:41:39 INFO - Running setup.py install for mozprocess 17:41:39 INFO - Running setup.py install for mozprofile 17:41:39 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:41:39 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:41:39 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:41:39 INFO - Running setup.py install for mozrunner 17:41:40 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:41:40 INFO - Running setup.py install for mozscreenshot 17:41:40 INFO - Running setup.py install for moztest 17:41:40 INFO - Running setup.py install for mozversion 17:41:40 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:41:40 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:41:40 INFO - Cleaning up... 17:41:40 INFO - Return code: 0 17:41:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:41:40 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')]} 17:41:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:41:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:40 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')]} 17:41:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:41:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:40 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 0x10aa14490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9f1228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f818a64a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9379f0>, '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 0x10a697db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a92b8c8>, '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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:41:40 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 17:41:40 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 17:41:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.9OGnLYvyPW/Render', 17:41:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:41:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:41:40 INFO - 'HOME': '/Users/cltbld', 17:41:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:41:40 INFO - 'LOGNAME': 'cltbld', 17:41:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:41:40 INFO - 'MOZ_NO_REMOTE': '1', 17:41:40 INFO - 'NO_EM_RESTART': '1', 17:41:40 INFO - 'PAGER': '/bin/cat', 17:41:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:41:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:41:40 INFO - 'PWD': '/builds/slave/test', 17:41:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:41:40 INFO - 'SHELL': '/bin/bash', 17:41:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.jRgd2NIRPt/Listeners', 17:41:40 INFO - 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/', 17:41:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:41:40 INFO - 'USER': 'cltbld', 17:41:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:41:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:41:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:41:40 INFO - 'XPC_FLAGS': '0x0', 17:41:40 INFO - 'XPC_SERVICE_NAME': '0', 17:41:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 17:41:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:41:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:41:41 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-xOUhTx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:41:41 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)) 17:41:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:41:41 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-OHthun-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:41:41 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)) 17:41:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:41:41 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-pYC9HO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:41:41 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)) 17:41:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:41:41 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-a8IIPK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:41:41 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)) 17:41:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:41:41 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-b1Oodi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:41:41 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)) 17:41:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:41:41 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-Xy2EvZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:41:41 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)) 17:41:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:41:41 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-5dVNfA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:41:42 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)) 17:41:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:41:42 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-OkXMe_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:41:42 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)) 17:41:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:41:42 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-eK68CL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:41:42 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)) 17:41:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:41:42 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-X0XPYH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:41:42 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)) 17:41:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:41:42 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-cDXEyM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:41:42 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)) 17:41:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:41:42 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-kysORn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:41:42 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)) 17:41:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:41:42 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-I6ywrf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:41:42 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)) 17:41:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:41:42 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-2y_c4B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:41:43 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)) 17:41:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:41:43 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-nyiTxC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:41:43 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)) 17:41:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:41:43 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-kL5hK_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:41:43 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)) 17:41:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:41:43 INFO - Running setup.py (path:/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/pip-3pn5UY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:41:43 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)) 17:41:43 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)) 17:41:43 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)) 17:41:43 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)) 17:41:43 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)) 17:41:43 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)) 17:41:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:41:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:41:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:41:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:41:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:41:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:41:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:41:46 INFO - Downloading blessings-1.5.1.tar.gz 17:41:46 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 17:41:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:41:46 INFO - Installing collected packages: blessings 17:41:46 INFO - Running setup.py install for blessings 17:41:46 INFO - Successfully installed blessings 17:41:46 INFO - Cleaning up... 17:41:46 INFO - Return code: 0 17:41:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:41:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:41:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:41:47 INFO - Reading from file tmpfile_stdout 17:41:47 INFO - Current package versions: 17:41:47 INFO - blessings == 1.5.1 17:41:47 INFO - blobuploader == 1.2.4 17:41:47 INFO - docopt == 0.6.1 17:41:47 INFO - manifestparser == 1.1 17:41:47 INFO - mozInstall == 1.12 17:41:47 INFO - mozcrash == 0.16 17:41:47 INFO - mozdebug == 0.1 17:41:47 INFO - mozdevice == 0.47 17:41:47 INFO - mozfile == 1.2 17:41:47 INFO - mozhttpd == 0.7 17:41:47 INFO - mozinfo == 0.9 17:41:47 INFO - mozleak == 0.1 17:41:47 INFO - mozlog == 3.0 17:41:47 INFO - moznetwork == 0.27 17:41:47 INFO - mozprocess == 0.22 17:41:47 INFO - mozprofile == 0.27 17:41:47 INFO - mozrunner == 6.11 17:41:47 INFO - mozscreenshot == 0.1 17:41:47 INFO - mozsystemmonitor == 0.0 17:41:47 INFO - moztest == 0.7 17:41:47 INFO - mozversion == 1.4 17:41:47 INFO - psutil == 3.1.1 17:41:47 INFO - requests == 1.2.3 17:41:47 INFO - wsgiref == 0.1.2 17:41:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:41:47 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')]} 17:41:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:41:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:47 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')]} 17:41:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:41:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:41:47 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 0x10aa14490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9f1228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f818a64a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10a9379f0>, '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 0x10a697db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a92b8c8>, '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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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 17:41:47 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 17:41:47 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 17:41:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.9OGnLYvyPW/Render', 17:41:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:41:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:41:47 INFO - 'HOME': '/Users/cltbld', 17:41:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:41:47 INFO - 'LOGNAME': 'cltbld', 17:41:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:41:47 INFO - 'MOZ_NO_REMOTE': '1', 17:41:47 INFO - 'NO_EM_RESTART': '1', 17:41:47 INFO - 'PAGER': '/bin/cat', 17:41:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:41:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:41:47 INFO - 'PWD': '/builds/slave/test', 17:41:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:41:47 INFO - 'SHELL': '/bin/bash', 17:41:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.jRgd2NIRPt/Listeners', 17:41:47 INFO - 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/', 17:41:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:41:47 INFO - 'USER': 'cltbld', 17:41:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:41:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:41:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:41:47 INFO - 'XPC_FLAGS': '0x0', 17:41:47 INFO - 'XPC_SERVICE_NAME': '0', 17:41:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 17:41:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 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)) 17:41:47 INFO - Cleaning up... 17:41:47 INFO - Return code: 0 17:41:47 INFO - Running post-action listener: _resource_record_post_action 17:41:47 INFO - Running post-action listener: _start_resource_monitoring 17:41:47 INFO - Starting resource monitoring. 17:41:47 INFO - ##### 17:41:47 INFO - ##### Running install step. 17:41:47 INFO - ##### 17:41:47 INFO - Running pre-action listener: _resource_record_pre_action 17:41:47 INFO - Running main action method: install 17:41:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:41:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:41:47 INFO - Reading from file tmpfile_stdout 17:41:47 INFO - Detecting whether we're running mozinstall >=1.0... 17:41:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:41:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:41:47 INFO - Reading from file tmpfile_stdout 17:41:47 INFO - Output received: 17:41:47 INFO - Usage: mozinstall [options] installer 17:41:47 INFO - Options: 17:41:47 INFO - -h, --help show this help message and exit 17:41:47 INFO - -d DEST, --destination=DEST 17:41:47 INFO - Directory to install application into. [default: 17:41:47 INFO - "/builds/slave/test"] 17:41:47 INFO - --app=APP Application being installed. [default: firefox] 17:41:47 INFO - mkdir: /builds/slave/test/build/application 17:41:47 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'] 17:41:47 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 17:42:30 INFO - Reading from file tmpfile_stdout 17:42:30 INFO - Output received: 17:42:30 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 17:42:30 INFO - Running post-action listener: _resource_record_post_action 17:42:30 INFO - ##### 17:42:30 INFO - ##### Running run-tests step. 17:42:30 INFO - ##### 17:42:30 INFO - Running pre-action listener: _resource_record_pre_action 17:42:30 INFO - Running main action method: run_tests 17:42:30 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:42:30 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:42:30 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:42:30 INFO - 2015-11-11 17:42:30.277 screenresolution[1931:9148] starting screenresolution argv=screenresolution get 17:42:30 INFO - 2015-11-11 17:42:30.281 screenresolution[1931:9148] Display 0: 1600x1200x32@60 17:42:30 INFO - 2015-11-11 17:42:30.288 screenresolution[1932:9150] starting screenresolution argv=screenresolution list 17:42:30 INFO - Available Modes on Display 0 17:42:30 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:42:30 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:42:30 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:42:30 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:42:30 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:42:30 INFO - Intel HD Graphics 3000: 17:42:30 INFO - Chipset Model: Intel HD Graphics 3000 17:42:30 INFO - Type: GPU 17:42:30 INFO - Bus: Built-In 17:42:30 INFO - VRAM (Total): 512 MB 17:42:30 INFO - VRAM (Dynamic, Max): 10 17:42:30 INFO - Vendor: Intel (0x8086) 17:42:30 INFO - Device ID: 0x0116 17:42:30 INFO - Revision ID: 0x0009 17:42:30 INFO - Displays: 17:42:30 INFO - Display: 17:42:30 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:42:30 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:42:30 INFO - Display Serial Number: 1600x1200 60 17:42:30 INFO - Main Display: Yes 17:42:30 INFO - Mirror: Off 17:42:30 INFO - Online: Yes 17:42:30 INFO - Rotation: Supported 17:42:30 INFO - Return code: 0 17:42:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:42:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:42:30 INFO - Python 2.7.3 17:42:30 INFO - Return code: 0 17:42:30 INFO - grabbing minidump binary from tooltool 17:42:30 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')]} 17:42:30 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 0x10a9379f0>, '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 0x10a697db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10a92b8c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:42:30 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 17:42:30 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 17:42:30 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:42:30 INFO - Return code: 0 17:42:30 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 17:42:30 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:42:30 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:42:30 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 17:42:30 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:42:30 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/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0040', '--webServer', 'localhost'] in /builds/slave/test/build 17:42:30 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/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0040 --webServer localhost 17:42:30 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.9OGnLYvyPW/Render', 17:42:30 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:42:30 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:42:30 INFO - 'HOME': '/Users/cltbld', 17:42:30 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:42:30 INFO - 'LOGNAME': 'cltbld', 17:42:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:42:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 17:42:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:42:30 INFO - 'MOZ_NO_REMOTE': '1', 17:42:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:42:30 INFO - 'NO_EM_RESTART': '1', 17:42:30 INFO - 'PAGER': '/bin/cat', 17:42:30 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:42:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:42:30 INFO - 'PWD': '/builds/slave/test', 17:42:30 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:42:30 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:42:30 INFO - 'SHELL': '/bin/bash', 17:42:30 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.jRgd2NIRPt/Listeners', 17:42:30 INFO - 'TMPDIR': '/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/', 17:42:30 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:42:30 INFO - 'USER': 'cltbld', 17:42:30 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:42:30 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:42:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:42:30 INFO - 'XPC_FLAGS': '0x0', 17:42:30 INFO - 'XPC_SERVICE_NAME': '0', 17:42:30 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 17:42:30 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/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0040', '--webServer', 'localhost'] with output_timeout 3600 17:42:31 INFO - mozversion INFO | application_buildid: 20151111160710 17:42:31 INFO - mozversion INFO | application_changeset: e4d573fb1fc1864531bc84c1a57ce61b79b9c076 17:42:31 INFO - mozversion INFO | application_display_name: Nightly 17:42:31 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:42:31 INFO - mozversion INFO | application_name: Firefox 17:42:31 INFO - mozversion INFO | application_remotingname: firefox 17:42:31 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 17:42:31 INFO - mozversion INFO | application_vendor: Mozilla 17:42:31 INFO - mozversion INFO | application_version: 45.0a1 17:42:31 INFO - mozversion INFO | platform_buildid: 20151111160710 17:42:31 INFO - mozversion INFO | platform_changeset: e4d573fb1fc1864531bc84c1a57ce61b79b9c076 17:42:31 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 17:42:31 INFO - mozversion INFO | platform_version: 45.0a1 17:42:31 INFO - 2015-11-11 17:42:31,040 DEBUG : using testdate: 1447292551 17:42:31 INFO - 2015-11-11 17:42:31,040 DEBUG : actual date: 1447292551 17:42:31 INFO - 2015-11-11 17:42:31,051 INFO : starting webserver on 'localhost:49330' 17:42:31 INFO - 2015-11-11 17:42:31,052 INFO : Starting test suite t-yosemite-r5-0040.e 17:42:31 INFO - 2015-11-11 17:42:31,052 INFO : Starting test dromaeo_css 17:42:31 INFO - 2015-11-11 17:42:31,052 DEBUG : operating with platform_type : mac_ 17:42:31 INFO - 2015-11-11 17:42:31,053 INFO : Initialising browser for dromaeo_css test... 17:42:31 INFO - 2015-11-11 17:42:31,081 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/tmpoAif4h/profile http://localhost:49330/getInfo.html 17:42:35 INFO - 2015-11-11 17:42:35,631 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 17:42:35 INFO - 2015-11-11 17:42:35,632 DEBUG : BROWSER_OUTPUT: colorDepth:24 17:42:35 INFO - 2015-11-11 17:42:35,632 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 17:42:35 INFO - 2015-11-11 17:42:35,632 DEBUG : BROWSER_OUTPUT: __metrics 17:42:36 INFO - 2015-11-11 17:42:36,395 INFO : Browser initialized. 17:42:36 INFO - 2015-11-11 17:42:36,396 INFO : Running cycle 1/1 for dromaeo_css test... 17:42:36 INFO - 2015-11-11 17:42:36,396 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/tmpoAif4h/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 17:42:48 INFO - 2015-11-11 17:42:48,868 DEBUG : BROWSER_OUTPUT: RSS: Main: 241491968 17:42:48 INFO - 2015-11-11 17:42:48,869 DEBUG : BROWSER_OUTPUT: 17:43:38 INFO - 2015-11-11 17:43:38,719 DEBUG : BROWSER_OUTPUT: 1447292618717 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] 17:45:49 INFO - 2015-11-11 17:45:49,222 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49330/tests/dromaeo/cssquery-ext.html) 17:45:50 INFO - 2015-11-11 17:45:50,344 DEBUG : BROWSER_OUTPUT: RSS: Main: 265998336 17:45:50 INFO - 2015-11-11 17:45:50,344 DEBUG : BROWSER_OUTPUT: 17:48:52 INFO - 2015-11-11 17:48:52,501 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/dromaeo/cssquery-ext.html (next: http://localhost:49330/tests/dromaeo/cssquery-jquery.html) 17:48:53 INFO - 2015-11-11 17:48:53,085 DEBUG : BROWSER_OUTPUT: RSS: Main: 272896000 17:48:53 INFO - 2015-11-11 17:48:53,086 DEBUG : BROWSER_OUTPUT: 17:51:54 INFO - 2015-11-11 17:51:54,966 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49330/tests/dromaeo/cssquery-mootools.html) 17:51:55 INFO - 2015-11-11 17:51:55,563 DEBUG : BROWSER_OUTPUT: RSS: Main: 275779584 17:51:55 INFO - 2015-11-11 17:51:55,564 DEBUG : BROWSER_OUTPUT: 17:54:57 INFO - 2015-11-11 17:54:57,279 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49330/tests/dromaeo/cssquery-prototype.html) 17:54:57 INFO - 2015-11-11 17:54:57,870 DEBUG : BROWSER_OUTPUT: RSS: Main: 278396928 17:54:57 INFO - 2015-11-11 17:54:57,871 DEBUG : BROWSER_OUTPUT: 17:58:00 INFO - 2015-11-11 17:58:00,517 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49330/tests/dromaeo/cssquery-yui.html) 17:58:01 INFO - 2015-11-11 17:58:01,125 DEBUG : BROWSER_OUTPUT: RSS: Main: 284459008 17:58:01 INFO - 2015-11-11 17:58:01,125 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,525 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/dromaeo/cssquery-yui.html (next: http://localhost:49330/tests/dromaeo/cssquery-dojo.html) 18:01:03 INFO - 2015-11-11 18:01:03,779 DEBUG : BROWSER_OUTPUT: RSS: Main: 288796672 18:01:03 INFO - 2015-11-11 18:01:03,780 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,780 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:01:03 INFO - 2015-11-11 18:01:03,780 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:01:03 INFO - 2015-11-11 18:01:03,780 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:01:03 INFO - 2015-11-11 18:01:03,780 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:01:03 INFO - 2015-11-11 18:01:03,782 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2511.7362676918924;2562.8974841006357;2589.145581957955;2637.301115204471;2643.6563246777914;4411.911761764767;4478.776061196943;4485.058137791059;4544.477385100715;4632.374629425027;4329.93505097423;4382.386465894777;4423.712458690191;4453.265211240149;4507.166174257764;4158.4386107875425;4214.915701685964;4264.211120942636;4282.764447955361;4330.761808100569;453.2796492248169;4104.384342348641;4193.350030745224;4247.511536173333;4312.05134870328;4059.9594004060173;4131.566185550504;4160.54234034256;4196.81114349855;4209.3054645983375;4206.284931561642;4210.5578914213875;4239.554846741079;4266.296061149907;4288.31386978082;3973.6821054315587;4104.794760262005;4130.0294430808735;4270.210011147948;4279.315309550489;4252.425922500484;4320.243957307459;4479.776011199427;4509.526499717548;4534.8186072557055;4778.665493415462;4780.976095119537;4854.878628034292;4869.780859861315;4924.433690125646;4682.438107427097;4710.458297295786;4761.738104404257;4833.3958255218095;4833.782479788418;4511.323301504768;4531.365608814768;4555.430571178603;4582.312653102062;4600.447946246439;4883.853484395474;4932.1122198004705;4943.307936888838;5014.423341315795;5025.949740502621;4554.84058057973;4601.24079526881;4703.270992996091;4739.715617062987;4782.904341913142;4739.454962679267;4872.512748725099;4872.756362181947;4921.138800709861;4951.752412379366;4659.603933665609;4742.644301677388;4765.26138448541;4824.8793780155775;4836.613070954386;4576.794044268016;4667.579917807414;4691.601213896857;4695.154872123051;4704.341392205094;3609.675129238381;3672.761270517408;3681.1349332906743;3682.0978860179425;3714.7399682022537;3240.3195328980705;3331.950020749691;3358.445856433661;3387.356402283558;3407.812570308607;4402.801873915681;4417.315316126005;4459.44256967879;4470.821167153343;4522.23122069249;4763.8332658357485;4824.34871292378;4839.612830973514;4847.684900481528;4907.362042934467;4295.269804133305;4320.416743739618;4380.386745855582;4483.21543729846;4509;4171;4236.5763423658;4242.490901091827;4289.292266775947;4289.335153051282;4889.657723959289;4960.057589058068;4967.205247160509;4971.577415919687;5037.4458809530925;4618.653600979873;4695.906081878275;4733.952660473351;4807.471178170468;4831.758412079453;4959.876003099951;5001.57486613642;5009.624278179078;5010.323606313101;5080.542751152266;4777.4505931818285;4797.520247975314;4813.180464384241;4837.975810120927;4887.633427493023;4625.907481850411;4734.360861283682;4782.473927868002;4814.013127308824;4820.71075735457;4600.470945841137;4651.488336283074;4741.5021422750115;4755.548222918817;4800.087983283165;4543;4742.502037286174;4756.667033307774;4758.262469317261;4777.761111944319;4449.844255451044;4481.574250446332;4511.661625378044;4565.246734288805;4580.0610874771255;4716.528347165256;4719.74041427711;4722.976385118052;4729.219678752967;4780.498047704941;4403.537628549085;4604.8388306409115;4649.930251046169;4688.882777930579;4750.12122757291 18:01:03 INFO - 2015-11-11 18:01:03,783 DEBUG : BROWSER_OUTPUT: |1;ext.html;430.91597138557995;451.25542854290416;457.1747994869262;480.12377411224514;484.7818481683239;31177.532337014934;31841.203969900707;31887.84056079722;31948.20129496764;32461.350772984555;34021.48967765479;34232.48651270233;34573;34732;34908.825455872684;7489.9251007489775;7659.272369124924;7667.693292268331;7718.807029824243;7732.226777322279;7503.137139228977;7541.622918854063;7555.357794587467;7684;7712.267334603203;7512.286332798402;7583.962080189619;7585.658645360944;7588;7781.027371578552;7620.809479763023;7632.427567932399;7640.388768898475;7656.042994625672;7657.846843063107;7428.257174282582;7450.739224127129;7495.812604684872;7594.772156835304;7689.846203075907;31888.521672174935;31919.840400797846;31944.201394965312;31955.680443195502;31995.040148795575;2117.872927624332;2231.6456138773588;2386.4391867911027;2455.0793452455327;2592;21457;21972.340829775134;22330.218442354602;22504;23276.883615581814;1941.2914286285545;1945.5914258005835;1981.6532106881239;2000.339887837025;2012.6578481658007;191131;191403;192392;194526.0547394522;196001;42577.36133957993;43739.78130109329;44833;45098;45203;48247;48325.51674483281;48970.77573060702;49834.25248621274;50041;12768.489260429664;12939;12961.351932403342;12968.481260749464;13103.672408189872;9881.703548893545;9910.256730745079;10020.749481262881;10085.899141008642;10101.393916365041;14358.641033974025;14462.349194286073;14693.706125877423;14998.100113993196;15337.386504539694;6339;6604.471642268607;6617.172853393326;6623.701933413008;6671.899921501182;784.8979632647719;794.2216627704767;858.2533196119416;893.8078313162702;951.2912879904516;22629.773702263097;22861.542769144857;22964.770352296262;23088.769112308997;23190.884045579664;871.8474267003376;883.9558022098869;891.2869704236584;904.3624244907325;981.6956743409565;11671.766564668658;11813.940930295465;11833.763324733458;11837;11877.287362758263;251102;252641;253073;255184;256692;42664.36003459951;43052.569474305485;43113.13773724508;43159.35260971088;43591.56408435939;938.7371535969803;947.1333729637305;947.9099485549;948.9525523723786;1102.818035024228;22244.555108897406;22736.65895011543;22754.089836406358;22759.86200689992;22822.201222957116;36973.6302636981;37403.625963740014;37868.431973519866;38098.61901381062;38252.80873595614;224854;225224;227200;227889;228808;24567;25537.616935745606;25589.232323030337;25611.231663050137;25847.353816154748;30740.538891916192;31086.22284442907;31096.844515777277;31369.8431507841;31685.04944851658;27113.1866044019;27585;28120.578191327557;28261.434771304048;28338.574921375784;27755.44489110247;27877.58183627288;28314.433711325248;28574.142775716762;28603.713962860103;28303.433931320847;28484.572731408633;28537.714622853506;28578.142655720363;28625.856870716347;24714.876425617756;25176.74823251744;25185.244442666015;25488.362790930376;25571.488570228863;19317.227310907405;19479.415617531497;19543.70684439706;19892.403227903185;19900.60198795987 18:01:03 INFO - 2015-11-11 18:01:03,787 DEBUG : BROWSER_OUTPUT: |2;jquery.html;272.04105528013764;273.451729282788;274.1569673254741;274.8653159951624;281.10748373912827;11211.551537938472;13932.860671393282;14383.784243236347;14478.855211447895;14812.407503699838;14352.56942291733;14445.711085778277;15370.615734606641;15836.683266334667;16031.438899638515;4774.928376074362;4847.369841920563;5022.874428139289;5087.694738315695;5095.261187127864;5081.898362032757;5098.184290513518;5105.285260063594;5151.639385243035;5169.534741873231;3514.595821480537;3719.2375563009655;4967.254911763228;5011.924821127686;5444.428335024825;5611.7474713637985;5637.943620563783;5687.857803554903;5696.458836410535;5706.1440783882335;5344.011357898801;5370.43610420904;5374.086405311106;5399.62202645815;5430.782768689248;18421.263149474005;18657.160427780782;18832.717509237373;18894.716579251322;19076;1616.2161351744394;1676.2624445244053;1732.4542769027842;1775.2100315359671;1829.826166514179;11021.724456888562;11528.654140375802;11793.528258869721;11855.822162667568;12314.753704925852;1427.1365823676733;1490.6422458609964;1573.8976966497141;1631.796025496813;1654.024125765804;54519;54540;54723.9999999996;55591.722041389534;56067.15899261514;14091.71816563663;14187.077839940577;14220.786688199685;14307.57077287683;14446.783298250535;19861.801381986283;20059.899700501403;20081.096350664255;20187.596248074955;20270.189192432434;8215.055268644062;8215.712450064219;8259.628316725762;8293.543855087908;8328.583570821556;6971.965140174369;7015.36861682451;7049.330313620198;7054.858902821915;7117;6666.500012499082;6706.26231114577;6757.966210168917;6800.721758210956;6931.480138989596;2693.2189664997322;2779.722027797204;2782.7217278272415;2793;2803.2711495011445;316.291507024264;324.5715655334935;326.9558609587675;338.8746163919316;341.142027800083;8118.715844945516;8615.91384086151;8666.739997800076;8671.56642167889;8724.171203735636;332.0702034303939;338.81195936255614;341.3241781273044;342.33757678891425;345.09240696966816;4499.797509112098;4785.569298763128;5057.570106540985;5260.815871444481;5434.8913021739345;426524;439460;443805;450292;453864;57719;57752.422475775544;59076.7046164775;60243;61037.38962610317;392.94302326162546;408.8589436644293;409.5331322292589;410.9137081212979;414.06421487438604;8675.783105422162;8917.152870477294;8988.820223595361;9007.954960225157;9129.954350228207;25344.746552534238;26311.21066368012;27196.456070878077;28041.719582804726;28492.57261141043;36663.450048248764;36738.448923266704;36794;36895;37163.6283637171;5061.848144555669;5112;5123.666961647481;5152.5854831418965;5214.270002199771;9685.951570242103;9747.317687761788;9819.312648114848;9827.950860245654;9901.504924753877;7737.6518056686455;8141.511509309224;8557.700480483154;8634.870476942977;8639.95680021596;8276;8278.751637450887;8334.333253339597;8374.35968986057;8479.279261262862;8548.786280343042;8559.614817333111;8593.52735599548;8653.913460865311;8736.650533978824;4961.603071754179;5080.695158290514;5083.898322033612;5102.948970510248;5104.668196567211;8321.6671333146;8447.746567602982;8512.063672995842;8586.22723954847;8633.30933525304 18:01:03 INFO - 2015-11-11 18:01:03,787 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1430.563678078186;1444.57385071404;1454.4691187716487;1481.9629509262268;1525.8321584625692;5794.217780599618;5827.242458480391;6353.809385718424;6544.934550654492;6549;6157.876842463148;6234.906476402846;6397.296297407293;6406.743730250784;6447.54867159299;1808.4393837910225;1810.6650269700083;1832.8075552067041;1846.2153584726505;1847.7136043913215;1826.205600563759;1850.4263678259783;1861.0229629444514;1872.541227399289;1884.3404808317048;1833.62410705805;1858.9163487643089;1859.395696398669;1863.30126202674;1896.7534220551308;1764.2061072517354;1785.4732853808027;1789.2842862854832;1791.4894255137224;1813.9002354870477;1782.7593274907852;1788.2131861980688;1797.3080364059801;1797.9820201797945;1815.0743121008381;6432.935670643327;6504.479641628658;6537.869242615168;6569.244536878225;6618.966905165444;3891.1633998690418;3992;4012.6388625023887;4057.371107478316;4103.2409004334295;2124.702541644171;2154.6983422320886;2387.2002879035545;2437.463757973243;2481.5781317175943;721.5093736259341;729.8868675355276;737.9483436159471;739.970401183952;763.2062654838961;8713.738587842376;8717.389782715212;8777.64889404423;8823.514706691129;8940.105989401072;3626.7461277710836;3626.9093272668392;3644.890653280406;3646.872359467406;3650.8174591270863;7584.696612135453;7585.886211706828;7637.083549974039;7745.690172393154;7755.185705500954;4040.8585699500377;4050.10897602527;4051.39229115635;4066.7153299268766;4079.347304431336;3647.1976165243605;3668.559772827278;3672.761270517408;3692.723045771524;3729.347364211252;3077.061496243667;3109.5024796032526;3111.797733147338;3113.252819323346;3133.702298281705;1021.371856308365;1024.6106479537877;1033.617561502249;1035.891231420705;1059.2426415113077;900.8108297257518;903.3766700976305;904.1771987491351;904.674317245791;1065.912768975656;6095.085737139376;6154.138420621117;6181.072839074085;6246.656433896089;6253.999360102453;346.88899552143073;364.0806962419911;367.82712125301066;370.0397468569059;371.9702423806089;4715.504871988392;4791;4805.735684537384;4861.465238823726;4874.902501949941;7149.714011439484;7177;7669.194734552903;7728.22717728234;7738.2261773822165;7601.809954751065;7645.541267523967;7660.463767536219;7714.228577142241;7730.342920851678;5937.406259374028;5951.672658003851;6029.939700603026;6073.96963015191;6130.570860039755;5856.033754430471;5896.823095307148;5902.881942361215;5921.052631578927;5957.046872500379;6598.802035938929;6692.063111164343;6743.022261771917;6871.072405225231;6973.163220413583;7027.9297207027275;7038.577685338896;7053.0830991970715;7072.893906591303;7100.254473280438;5595.440455954535;5627.971860140673;5639.6334238274385;5644.3508996465935;5706.229658995982;6158.168647232746;6169.383061693795;6186.659733714689;6217.09852071438;6253.718582663882;5477.561795056306;5547.500724934614;5708.6574805510145;5726.312842458931;5960.284765828128;5536.114221724505;5555.138953462219;5583.0787919992745;5608.074667679787;5644.238027866186;5579.051561234519;5602.579806514609;5630.7466164023535;5653.208550802973;5723.942760572341;5237.7119258439625;5238.633295669267;5240.266362709148;5254.710990895537;5318.228856815817;5159.716215608178;5249.448807875118;5296.894062118659;5315.601329900195;5340.706261155674 18:01:03 INFO - 2015-11-11 18:01:03,791 DEBUG : BROWSER_OUTPUT: |4;prototype.html;251.7608272141465;257.4233716475096;266.28768045478347;266.5508617978705;267.8928428628548;4957.454679985203;5017.1220036493605;5026.773795179217;5078.669886457377;5132.846014619558;4897.265410188474;5006.874828129298;5080.720560369178;5109.0803655342115;5117.283580298761;3957.7427467214684;3959.6634286085646;3974.960250397488;3995.0811313397935;4001;3996.6203210695085;4000.6999475039343;4008.639222469977;4023.4769479967563;4036.374361973884;3938.4289278054666;3948.2498325318243;3968.127012057357;3969.3053715599654;3978.124812541236;3774.9056273593105;3893;3908.7850168240734;3919.980400097981;3921.4706014687936;3316.121227874591;3326.5176549400444;3343.749218808599;3350.145712843234;3359.5968483781858;4899.387576552931;4947.579455746266;4947.604191664658;4978.87552811179;5034.993001399698;4244.172386384656;4267.295896177127;4298.914021719548;4304;4304.375865499485;5295.708736019517;5296.576273898079;5298.496642818965;5307.708076055816;5355.839324820262;3478.286951175028;3504.8422820972864;3536.964630353715;3558.4128618777872;3570.9107272318142;5392.676439413609;5477.287952566181;5580.023495888244;5632.9436705632825;5634.3520495143175;3542.4686297055646;3564.7861128332383;3597.5862775780597;3602.7750564807566;3625.456181572785;3640.9453858192146;3647.0335361129323;3676.522052133259;3698.389765688631;3709.3137769512728;4258.723182993158;4280.293751531025;4293.205756934977;4312.353147027971;4321.762303073298;5215.374155101412;5353.357597088374;5384.057789886754;5392.676439413648;5413.323334583177;1282.3203702037936;1304.4977683591885;1325.516186591887;1336.0580790542645;1345.7712188927906;836.8535506286497;846.8687353460224;853.487907255654;858.1118542308681;862.0302160069921;5025.623078269145;5046.1926091825135;5084.13569693153;5131.589472842164;5182.4299327073995;5499.422560631157;5541.168824676251;5558.583106267046;5580.860478487989;5592.356878958891;5028.396592408934;5067.442581316052;5074.873128171826;5117.590592752571;5119.564836988898;2945.9852700736787;3058.8929387471776;3066.601341825593;3071.5699802027734;3088.336007758343;5638.379778224392;5673.035583950738;5727.4845263926445;5741.511971482387;5765.1928729977835;5419.485148910847;5600.27196464457;5622.409646987089;5664.773409063674;5690.2887139107615;5595.916061259084;5667.773289068474;5716.628419152742;5719.57103217252;5763;5366.785328586813;5453.372862120907;5490.423505531861;5551;5557.083081291542;5353.491418315254;5354.7858085676135;5380.3274590676165;5400.891982160256;5452.59105567092;5438.428964958623;5713.314402271754;5826.329972053268;5834.18321435008;5863.413658634103;3641.453781932731;3656.6526180012856;3660.707143428466;3677.191017976041;3679.638533742532;5538.584606154474;5589.720513974366;5628.521575666115;5635.746391412315;5656.971715141398;5270;5376.354837419378;5398.1093119634825;5478.260434841245;5479.369872464717;5320.920186197288;5322.33470816148;5342.252084708066;5346.385165705994;5409.107497263065;5184.092783762751;5203.24552939814;5239.187925871496;5252.816151434681;5253.448387919213;5313.203019547099;5318.946810531846;5373.274607928036;5409.404965453718;5426.565874730091;5079.492050794891;5288.629795914249;5355.70543620089;5363.168708850135;5396.703181324908 18:01:03 INFO - 2015-11-11 18:01:03,792 DEBUG : BROWSER_OUTPUT: |5;yui.html;524.556749546633;589.7051474262869;607.4654304212293;617.1637431280612;632.5414074795774;10913.563457461692;11132.443377831116;11336.319820810757;11343.829842552368;11378.601748938789;11737.765244695102;11863.288202707843;11930.761384772299;12042.337671428068;12070.577529786458;550.4715473145785;703.6657587645878;704.6300692136643;705.964701764911;711.1999001123736;555.9833205003856;684.5721424109931;696.3036963036963;702.1609177033447;706.0715159565156;692.1382878316477;694.6839188169396;709.5813470052668;721.9639018049103;722.3679280629449;701.5580184483769;701.6982697440098;701.8912068629371;719.8344380792395;722.5917356693451;505.07319069507497;517.6040329148204;518.1036806325042;530.9275263966765;536.4554976698654;11229.60696375631;11373.715657108556;11375.488103035383;11396.601118960796;11416.71458213543;7743.615583016109;7799.766007019798;7945.523268603844;7995.760127196135;8292.917070829275;6980.267071957473;7119.03892974447;7154.856902861914;7189.784306470814;7564.092308922965;2369.2418426103654;2410.529946660402;2466.7903228225623;2487.2786891801356;2583.2239589547758;39284.80357598194;39577.60422395768;39841.40237896463;40095;40118.59881401178;5269.288646032813;5615.747291371898;5632.324121105494;5635.267415236075;5814.273215848019;9908.603655853829;10013.899861001442;10066.144377727975;10109.747256318651;10163.28856980019;5158.432572417031;5169.276301317818;5172.094883395391;5262.815801446931;5273.2617433559335;3031.5604237385455;3034.514477683604;3132.6554079051284;3215.6302025266928;3270.9509357359657;2256.8081713054244;2260.299307214736;2261.434641339665;2279.6922415474032;2290.6220473621665;337.3068344551969;343.24314885677023;349.1498201878384;355.4100193678481;356.2127697787866;414.7677300711551;469.84495116611436;476.82357527714277;502.274213761119;513.4813838023623;5634.464725851038;6308.495320374359;6315.115883776275;6395.904061439082;6701.564398314094;366.49789787990625;485.5266115537394;486.05073895519297;490.23033836876476;504.08256972310045;2746.2722378569697;3043.8325892075704;3086.845657717105;3113.2372568720807;3187.346593948235;48777.268340974915;48972.755136224805;52235.47764522382;52548;52834.47165528373;43089.78455107704;43814.78092609517;44076.77961610236;44460.77769611196;44791;40341.193176136316;40807.591924080974;41017.179656406704;41738.79130604328;41795.7910210447;6171.197744293213;6484.935150648433;6488.221413430419;6528;6612.867742645217;29707.55438668465;30493.74027338551;30512.08463746091;30522;30913.69086309108;36400.453993190655;39974;39990.200195995334;40161.1967760649;40759.59240407558;6042.728077236447;6049.364816694359;6167.969160154171;6239.407256310643;6501.869962600627;8975.910240897507;9062;9185.127412895765;9191.448513089235;9254.629814807333;8453.535055572003;8543.615537300711;8629.56852157377;8629.56852157377;8648.178423050053;8588.914110858812;8638.17937295956;8694.391392602458;8772.078931712334;8789;7880.724174653859;8354.62404191825;8498.957505212435;8604.268637165911;8642.22220000203;7077.964610176916;7518.887216691644;7680.078390593165;7782.221777822172;7955.9204407957495;7177.820554486179;7479.214682458482;7535.208803075599;7572.81067973283;7641.2740789624895 18:01:03 INFO - 2015-11-11 18:01:03,792 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:01:03 INFO - 2015-11-11 18:01:03,792 DEBUG : BROWSER_OUTPUT: __start_cc_report 18:01:03 INFO - 2015-11-11 18:01:03,792 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,303 18:01:03 INFO - 2015-11-11 18:01:03,792 DEBUG : BROWSER_OUTPUT: __end_cc_report 18:01:03 INFO - 2015-11-11 18:01:03,793 DEBUG : BROWSER_OUTPUT: __startTimestamp1447293663778__endTimestamp 18:01:03 INFO - 2015-11-11 18:01:03,793 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,793 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:01:03 INFO - 2015-11-11 18:01:03,793 DEBUG : BROWSER_OUTPUT: Number of tests: 6 18:01:03 INFO - 2015-11-11 18:01:03,793 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,793 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4449.71 Median:4600.45 stddev:583.81 (12.7%) stddev-sans-first:565.46 18:01:03 INFO - 2015-11-11 18:01:03,794 DEBUG : BROWSER_OUTPUT: Values: 2511.7 2562.9 2589.1 2637.3 2643.7 4411.9 4478.8 4485.1 4544.5 4632.4 4329.9 4382.4 4423.7 4453.3 4507.2 4158.4 4214.9 4264.2 4282.8 4330.8 453.3 4104.4 4193.4 4247.5 4312.1 4060.0 4131.6 4160.5 4196.8 4209.3 4206.3 4210.6 4239.6 4266.3 4288.3 3973.7 4104.8 4130.0 4270.2 4279.3 4252.4 4320.2 4479.8 4509.5 4534.8 4778.7 4781.0 4854.9 4869.8 4924.4 4682.4 4710.5 4761.7 4833.4 4833.8 4511.3 4531.4 4555.4 4582.3 4600.4 4883.9 4932.1 4943.3 5014.4 5025.9 4554.8 4601.2 4703.3 4739.7 4782.9 4739.5 4872.5 4872.8 4921.1 4951.8 4659.6 4742.6 4765.3 4824.9 4836.6 4576.8 4667.6 4691.6 4695.2 4704.3 3609.7 3672.8 3681.1 3682.1 3714.7 3240.3 3332.0 3358.4 3387.4 3407.8 4402.8 4417.3 4459.4 4470.8 4522.2 4763.8 4824.3 4839.6 4847.7 4907.4 4295.3 4320.4 4380.4 4483.2 4509.0 4171.0 4236.6 4242.5 4289.3 4289.3 4889.7 4960.1 4967.2 4971.6 5037.4 4618.7 4695.9 4734.0 4807.5 4831.8 4959.9 5001.6 5009.6 5010.3 5080.5 4777.5 4797.5 4813.2 4838.0 4887.6 4625.9 4734.4 4782.5 4814.0 4820.7 4600.5 4651.5 4741.5 4755.5 4800.1 4543.0 4742.5 4756.7 4758.3 4777.8 4449.8 4481.6 4511.7 4565.2 4580.1 4716.5 4719.7 4723.0 4729.2 4780.5 4403.5 4604.8 4649.9 4688.9 4750.1 18:01:03 INFO - 2015-11-11 18:01:03,795 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,795 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:36161.43 Median:31091.53 stddev:58960.99 (189.6%) stddev-sans-first:59065.36 18:01:03 INFO - 2015-11-11 18:01:03,796 DEBUG : BROWSER_OUTPUT: Values: 430.9 451.3 457.2 480.1 484.8 31177.5 31841.2 31887.8 31948.2 32461.4 34021.5 34232.5 34573.0 34732.0 34908.8 7489.9 7659.3 7667.7 7718.8 7732.2 7503.1 7541.6 7555.4 7684.0 7712.3 7512.3 7584.0 7585.7 7588.0 7781.0 7620.8 7632.4 7640.4 7656.0 7657.8 7428.3 7450.7 7495.8 7594.8 7689.8 31888.5 31919.8 31944.2 31955.7 31995.0 2117.9 2231.6 2386.4 2455.1 2592.0 21457.0 21972.3 22330.2 22504.0 23276.9 1941.3 1945.6 1981.7 2000.3 2012.7 191131.0 191403.0 192392.0 194526.1 196001.0 42577.4 43739.8 44833.0 45098.0 45203.0 48247.0 48325.5 48970.8 49834.3 50041.0 12768.5 12939.0 12961.4 12968.5 13103.7 9881.7 9910.3 10020.7 10085.9 10101.4 14358.6 14462.3 14693.7 14998.1 15337.4 6339.0 6604.5 6617.2 6623.7 6671.9 784.9 794.2 858.3 893.8 951.3 22629.8 22861.5 22964.8 23088.8 23190.9 871.8 884.0 891.3 904.4 981.7 11671.8 11813.9 11833.8 11837.0 11877.3 251102.0 252641.0 253073.0 255184.0 256692.0 42664.4 43052.6 43113.1 43159.4 43591.6 938.7 947.1 947.9 949.0 1102.8 22244.6 22736.7 22754.1 22759.9 22822.2 36973.6 37403.6 37868.4 38098.6 38252.8 224854.0 225224.0 227200.0 227889.0 228808.0 24567.0 25537.6 25589.2 25611.2 25847.4 30740.5 31086.2 31096.8 31369.8 31685.0 27113.2 27585.0 28120.6 28261.4 28338.6 27755.4 27877.6 28314.4 28574.1 28603.7 28303.4 28484.6 28537.7 28578.1 28625.9 24714.9 25176.7 25185.2 25488.4 25571.5 19317.2 19479.4 19543.7 19892.4 19900.6 18:01:03 INFO - 2015-11-11 18:01:03,796 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,797 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:23506.45 Median:5059.71 stddev:72337.98 (1429.7%) stddev-sans-first:72519.87 18:01:03 INFO - 2015-11-11 18:01:03,797 DEBUG : BROWSER_OUTPUT: Values: 272.0 273.5 274.2 274.9 281.1 11211.6 13932.9 14383.8 14478.9 14812.4 14352.6 14445.7 15370.6 15836.7 16031.4 4774.9 4847.4 5022.9 5087.7 5095.3 5081.9 5098.2 5105.3 5151.6 5169.5 3514.6 3719.2 4967.3 5011.9 5444.4 5611.7 5637.9 5687.9 5696.5 5706.1 5344.0 5370.4 5374.1 5399.6 5430.8 18421.3 18657.2 18832.7 18894.7 19076.0 1616.2 1676.3 1732.5 1775.2 1829.8 11021.7 11528.7 11793.5 11855.8 12314.8 1427.1 1490.6 1573.9 1631.8 1654.0 54519.0 54540.0 54724.0 55591.7 56067.2 14091.7 14187.1 14220.8 14307.6 14446.8 19861.8 20059.9 20081.1 20187.6 20270.2 8215.1 8215.7 8259.6 8293.5 8328.6 6972.0 7015.4 7049.3 7054.9 7117.0 6666.5 6706.3 6758.0 6800.7 6931.5 2693.2 2779.7 2782.7 2793.0 2803.3 316.3 324.6 327.0 338.9 341.1 8118.7 8615.9 8666.7 8671.6 8724.2 332.1 338.8 341.3 342.3 345.1 4499.8 4785.6 5057.6 5260.8 5434.9 426524.0 439460.0 443805.0 450292.0 453864.0 57719.0 57752.4 59076.7 60243.0 61037.4 392.9 408.9 409.5 410.9 414.1 8675.8 8917.2 8988.8 9008.0 9130.0 25344.7 26311.2 27196.5 28041.7 28492.6 36663.5 36738.4 36794.0 36895.0 37163.6 5061.8 5112.0 5123.7 5152.6 5214.3 9686.0 9747.3 9819.3 9828.0 9901.5 7737.7 8141.5 8557.7 8634.9 8640.0 8276.0 8278.8 8334.3 8374.4 8479.3 8548.8 8559.6 8593.5 8653.9 8736.7 4961.6 5080.7 5083.9 5102.9 5104.7 8321.7 8447.7 8512.1 8586.2 8633.3 18:01:03 INFO - 2015-11-11 18:01:03,797 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,797 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4478.52 Median:5581.07 stddev:2338.63 (41.9%) stddev-sans-first:2333.97 18:01:03 INFO - 2015-11-11 18:01:03,798 DEBUG : BROWSER_OUTPUT: Values: 1430.6 1444.6 1454.5 1482.0 1525.8 5794.2 5827.2 6353.8 6544.9 6549.0 6157.9 6234.9 6397.3 6406.7 6447.5 1808.4 1810.7 1832.8 1846.2 1847.7 1826.2 1850.4 1861.0 1872.5 1884.3 1833.6 1858.9 1859.4 1863.3 1896.8 1764.2 1785.5 1789.3 1791.5 1813.9 1782.8 1788.2 1797.3 1798.0 1815.1 6432.9 6504.5 6537.9 6569.2 6619.0 3891.2 3992.0 4012.6 4057.4 4103.2 2124.7 2154.7 2387.2 2437.5 2481.6 721.5 729.9 737.9 740.0 763.2 8713.7 8717.4 8777.6 8823.5 8940.1 3626.7 3626.9 3644.9 3646.9 3650.8 7584.7 7585.9 7637.1 7745.7 7755.2 4040.9 4050.1 4051.4 4066.7 4079.3 3647.2 3668.6 3672.8 3692.7 3729.3 3077.1 3109.5 3111.8 3113.3 3133.7 1021.4 1024.6 1033.6 1035.9 1059.2 900.8 903.4 904.2 904.7 1065.9 6095.1 6154.1 6181.1 6246.7 6254.0 346.9 364.1 367.8 370.0 372.0 4715.5 4791.0 4805.7 4861.5 4874.9 7149.7 7177.0 7669.2 7728.2 7738.2 7601.8 7645.5 7660.5 7714.2 7730.3 5937.4 5951.7 6029.9 6074.0 6130.6 5856.0 5896.8 5902.9 5921.1 5957.0 6598.8 6692.1 6743.0 6871.1 6973.2 7027.9 7038.6 7053.1 7072.9 7100.3 5595.4 5628.0 5639.6 5644.4 5706.2 6158.2 6169.4 6186.7 6217.1 6253.7 5477.6 5547.5 5708.7 5726.3 5960.3 5536.1 5555.1 5583.1 5608.1 5644.2 5579.1 5602.6 5630.7 5653.2 5723.9 5237.7 5238.6 5240.3 5254.7 5318.2 5159.7 5249.4 5296.9 5315.6 5340.7 18:01:03 INFO - 2015-11-11 18:01:03,798 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,799 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4459.03 Median:5117.44 stddev:1362.55 (26.6%) stddev-sans-first:1329.28 18:01:03 INFO - 2015-11-11 18:01:03,800 DEBUG : BROWSER_OUTPUT: Values: 251.8 257.4 266.3 266.6 267.9 4957.5 5017.1 5026.8 5078.7 5132.8 4897.3 5006.9 5080.7 5109.1 5117.3 3957.7 3959.7 3975.0 3995.1 4001.0 3996.6 4000.7 4008.6 4023.5 4036.4 3938.4 3948.2 3968.1 3969.3 3978.1 3774.9 3893.0 3908.8 3920.0 3921.5 3316.1 3326.5 3343.7 3350.1 3359.6 4899.4 4947.6 4947.6 4978.9 5035.0 4244.2 4267.3 4298.9 4304.0 4304.4 5295.7 5296.6 5298.5 5307.7 5355.8 3478.3 3504.8 3537.0 3558.4 3570.9 5392.7 5477.3 5580.0 5632.9 5634.4 3542.5 3564.8 3597.6 3602.8 3625.5 3640.9 3647.0 3676.5 3698.4 3709.3 4258.7 4280.3 4293.2 4312.4 4321.8 5215.4 5353.4 5384.1 5392.7 5413.3 1282.3 1304.5 1325.5 1336.1 1345.8 836.9 846.9 853.5 858.1 862.0 5025.6 5046.2 5084.1 5131.6 5182.4 5499.4 5541.2 5558.6 5580.9 5592.4 5028.4 5067.4 5074.9 5117.6 5119.6 2946.0 3058.9 3066.6 3071.6 3088.3 5638.4 5673.0 5727.5 5741.5 5765.2 5419.5 5600.3 5622.4 5664.8 5690.3 5595.9 5667.8 5716.6 5719.6 5763.0 5366.8 5453.4 5490.4 5551.0 5557.1 5353.5 5354.8 5380.3 5400.9 5452.6 5438.4 5713.3 5826.3 5834.2 5863.4 3641.5 3656.7 3660.7 3677.2 3679.6 5538.6 5589.7 5628.5 5635.7 5657.0 5270.0 5376.4 5398.1 5478.3 5479.4 5320.9 5322.3 5342.3 5346.4 5409.1 5184.1 5203.2 5239.2 5252.8 5253.4 5313.2 5318.9 5373.3 5409.4 5426.6 5079.5 5288.6 5355.7 5363.2 5396.7 18:01:03 INFO - 2015-11-11 18:01:03,800 DEBUG : BROWSER_OUTPUT: 18:01:03 INFO - 2015-11-11 18:01:03,800 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11148.41 Median:5266.05 stddev:14064.06 (267.1%) stddev-sans-first:14080.89 18:01:03 INFO - 2015-11-11 18:01:03,801 DEBUG : BROWSER_OUTPUT: Values: 524.6 589.7 607.5 617.2 632.5 10913.6 11132.4 11336.3 11343.8 11378.6 11737.8 11863.3 11930.8 12042.3 12070.6 550.5 703.7 704.6 706.0 711.2 556.0 684.6 696.3 702.2 706.1 692.1 694.7 709.6 722.0 722.4 701.6 701.7 701.9 719.8 722.6 505.1 517.6 518.1 530.9 536.5 11229.6 11373.7 11375.5 11396.6 11416.7 7743.6 7799.8 7945.5 7995.8 8292.9 6980.3 7119.0 7154.9 7189.8 7564.1 2369.2 2410.5 2466.8 2487.3 2583.2 39284.8 39577.6 39841.4 40095.0 40118.6 5269.3 5615.7 5632.3 5635.3 5814.3 9908.6 10013.9 10066.1 10109.7 10163.3 5158.4 5169.3 5172.1 5262.8 5273.3 3031.6 3034.5 3132.7 3215.6 3271.0 2256.8 2260.3 2261.4 2279.7 2290.6 337.3 343.2 349.1 355.4 356.2 414.8 469.8 476.8 502.3 513.5 5634.5 6308.5 6315.1 6395.9 6701.6 366.5 485.5 486.1 490.2 504.1 2746.3 3043.8 3086.8 3113.2 3187.3 48777.3 48972.8 52235.5 52548.0 52834.5 43089.8 43814.8 44076.8 44460.8 44791.0 40341.2 40807.6 41017.2 41738.8 41795.8 6171.2 6484.9 6488.2 6528.0 6612.9 29707.6 30493.7 30512.1 30522.0 30913.7 36400.5 39974.0 39990.2 40161.2 40759.6 6042.7 6049.4 6168.0 6239.4 6501.9 8975.9 9062.0 9185.1 9191.4 9254.6 8453.5 8543.6 8629.6 8629.6 8648.2 8588.9 8638.2 8694.4 8772.1 8789.0 7880.7 8354.6 8499.0 8604.3 8642.2 7078.0 7518.9 7680.1 7782.2 7955.9 7177.8 7479.2 7535.2 7572.8 7641.3 18:01:03 INFO - 2015-11-11 18:01:03,801 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:01:03 INFO - 2015-11-11 18:01:03,802 DEBUG : BROWSER_OUTPUT: 18:01:04 INFO - 2015-11-11 18:01:04,290 INFO : Browser exited with error code: 0 18:01:04 INFO - 2015-11-11 18:01:04,325 INFO : Completed test dromaeo_css (00:18:33) 18:01:04 INFO - 2015-11-11 18:01:04,326 INFO : Starting test kraken 18:01:04 INFO - 2015-11-11 18:01:04,326 DEBUG : operating with platform_type : mac_ 18:01:04 INFO - 2015-11-11 18:01:04,326 INFO : Initialising browser for kraken test... 18:01:04 INFO - 2015-11-11 18:01:04,342 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/tmpDgtbbW/profile http://localhost:49330/getInfo.html 18:01:07 INFO - 2015-11-11 18:01:07,887 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 18:01:07 INFO - 2015-11-11 18:01:07,887 DEBUG : BROWSER_OUTPUT: colorDepth:24 18:01:07 INFO - 2015-11-11 18:01:07,887 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 18:01:07 INFO - 2015-11-11 18:01:07,887 DEBUG : BROWSER_OUTPUT: __metrics 18:01:08 INFO - 2015-11-11 18:01:08,653 INFO : Browser initialized. 18:01:08 INFO - 2015-11-11 18:01:08,654 INFO : Running cycle 1/1 for kraken test... 18:01:08 INFO - 2015-11-11 18:01:08,654 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/tmpDgtbbW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 18:01:21 INFO - 2015-11-11 18:01:21,088 DEBUG : BROWSER_OUTPUT: RSS: Main: 240513024 18:01:21 INFO - 2015-11-11 18:01:21,089 DEBUG : BROWSER_OUTPUT: 18:01:24 INFO - 2015-11-11 18:01:24,075 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49330/tests/kraken/driver.html?testName=audio-beat-detection) 18:01:24 INFO - 2015-11-11 18:01:24,687 DEBUG : BROWSER_OUTPUT: RSS: Main: 259678208 18:01:24 INFO - 2015-11-11 18:01:24,687 DEBUG : BROWSER_OUTPUT: 18:01:27 INFO - 2015-11-11 18:01:27,806 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49330/tests/kraken/driver.html?testName=audio-dft) 18:01:28 INFO - 2015-11-11 18:01:28,408 DEBUG : BROWSER_OUTPUT: RSS: Main: 266907648 18:01:28 INFO - 2015-11-11 18:01:28,409 DEBUG : BROWSER_OUTPUT: 18:01:31 INFO - 2015-11-11 18:01:31,824 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49330/tests/kraken/driver.html?testName=audio-fft) 18:01:32 INFO - 2015-11-11 18:01:32,406 DEBUG : BROWSER_OUTPUT: RSS: Main: 268062720 18:01:32 INFO - 2015-11-11 18:01:32,406 DEBUG : BROWSER_OUTPUT: 18:01:34 INFO - 2015-11-11 18:01:34,648 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49330/tests/kraken/driver.html?testName=audio-oscillator) 18:01:35 INFO - 2015-11-11 18:01:35,241 DEBUG : BROWSER_OUTPUT: RSS: Main: 268509184 18:01:35 INFO - 2015-11-11 18:01:35,242 DEBUG : BROWSER_OUTPUT: 18:01:37 INFO - 2015-11-11 18:01:37,672 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49330/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:01:38 INFO - 2015-11-11 18:01:38,259 DEBUG : BROWSER_OUTPUT: RSS: Main: 268234752 18:01:38 INFO - 2015-11-11 18:01:38,259 DEBUG : BROWSER_OUTPUT: 18:01:41 INFO - 2015-11-11 18:01:41,851 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49330/tests/kraken/driver.html?testName=imaging-darkroom) 18:01:42 INFO - 2015-11-11 18:01:42,462 DEBUG : BROWSER_OUTPUT: RSS: Main: 265252864 18:01:42 INFO - 2015-11-11 18:01:42,462 DEBUG : BROWSER_OUTPUT: 18:01:46 INFO - 2015-11-11 18:01:46,166 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49330/tests/kraken/driver.html?testName=imaging-desaturate) 18:01:46 INFO - 2015-11-11 18:01:46,755 DEBUG : BROWSER_OUTPUT: RSS: Main: 266477568 18:01:46 INFO - 2015-11-11 18:01:46,756 DEBUG : BROWSER_OUTPUT: 18:01:50 INFO - 2015-11-11 18:01:50,167 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49330/tests/kraken/driver.html?testName=json-parse-financial) 18:01:50 INFO - 2015-11-11 18:01:50,757 DEBUG : BROWSER_OUTPUT: RSS: Main: 267378688 18:01:50 INFO - 2015-11-11 18:01:50,757 DEBUG : BROWSER_OUTPUT: 18:01:52 INFO - 2015-11-11 18:01:52,549 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49330/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:01:53 INFO - 2015-11-11 18:01:53,135 DEBUG : BROWSER_OUTPUT: RSS: Main: 267915264 18:01:53 INFO - 2015-11-11 18:01:53,135 DEBUG : BROWSER_OUTPUT: 18:01:55 INFO - 2015-11-11 18:01:55,191 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49330/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:01:55 INFO - 2015-11-11 18:01:55,826 DEBUG : BROWSER_OUTPUT: RSS: Main: 267661312 18:01:55 INFO - 2015-11-11 18:01:55,826 DEBUG : BROWSER_OUTPUT: 18:01:58 INFO - 2015-11-11 18:01:58,249 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49330/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:01:58 INFO - 2015-11-11 18:01:58,842 DEBUG : BROWSER_OUTPUT: RSS: Main: 267849728 18:01:58 INFO - 2015-11-11 18:01:58,842 DEBUG : BROWSER_OUTPUT: 18:02:01 INFO - 2015-11-11 18:02:01,953 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49330/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:02:02 INFO - 2015-11-11 18:02:02,550 DEBUG : BROWSER_OUTPUT: RSS: Main: 267837440 18:02:02 INFO - 2015-11-11 18:02:02,550 DEBUG : BROWSER_OUTPUT: 18:02:05 INFO - 2015-11-11 18:02:05,600 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49330/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:02:06 INFO - 2015-11-11 18:02:06,195 DEBUG : BROWSER_OUTPUT: RSS: Main: 268529664 18:02:06 INFO - 2015-11-11 18:02:06,195 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,150 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49330/tests/kraken/driver.html?testName=ai-astar) 18:02:08 INFO - 2015-11-11 18:02:08,408 DEBUG : BROWSER_OUTPUT: RSS: Main: 269484032 18:02:08 INFO - 2015-11-11 18:02:08,408 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,408 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:02:08 INFO - 2015-11-11 18:02:08,408 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:02:08 INFO - 2015-11-11 18:02:08,408 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:02:08 INFO - 2015-11-11 18:02:08,408 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |0;ai-astar;136;131;142;140;141;152;139;133;133;140 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;187;168;196;205;166;188;189;169;201;166 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |2;audio-dft;212;208;208;208;202;204;210;213;208;200 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |3;audio-fft;81;92;105;155;83;91;91;89;125;85 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;105;109;161;112;114;114;154;114;115;153 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;150;151;157;157;155;150;150;150;157;142 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;164;164;165;165;156;165;164;164;156;163 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;133;134;135;135;134;135;134;135;133;133 18:02:08 INFO - 2015-11-11 18:02:08,409 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;71;76;79;80;82;83;82;90;81;81 18:02:08 INFO - 2015-11-11 18:02:08,410 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;79;82;84;87;88;89;88;89;88;88 18:02:08 INFO - 2015-11-11 18:02:08,410 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;107;112;114;111;112;117;113;113;113;113 18:02:08 INFO - 2015-11-11 18:02:08,410 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;173;171;175;173;175;162;174;166;180;172 18:02:08 INFO - 2015-11-11 18:02:08,410 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;182;201;200;204;197;179;195;200;188;186 18:02:08 INFO - 2015-11-11 18:02:08,410 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;82;88;91;93;94;93;92;92;96;93 18:02:08 INFO - 2015-11-11 18:02:08,410 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:02:08 INFO - 2015-11-11 18:02:08,410 DEBUG : BROWSER_OUTPUT: __start_cc_report 18:02:08 INFO - 2015-11-11 18:02:08,411 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,768 18:02:08 INFO - 2015-11-11 18:02:08,411 DEBUG : BROWSER_OUTPUT: __end_cc_report 18:02:08 INFO - 2015-11-11 18:02:08,411 DEBUG : BROWSER_OUTPUT: __startTimestamp1447293728401__endTimestamp 18:02:08 INFO - 2015-11-11 18:02:08,411 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,411 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:02:08 INFO - 2015-11-11 18:02:08,411 DEBUG : BROWSER_OUTPUT: Number of tests: 14 18:02:08 INFO - 2015-11-11 18:02:08,412 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,412 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:138.70 Median:140.00 stddev:6.04 (4.3%) stddev-sans-first:6.32 18:02:08 INFO - 2015-11-11 18:02:08,412 DEBUG : BROWSER_OUTPUT: Values: 136.0 131.0 142.0 140.0 141.0 152.0 139.0 133.0 133.0 140.0 18:02:08 INFO - 2015-11-11 18:02:08,412 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,412 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:183.50 Median:188.50 stddev:15.09 (8.0%) stddev-sans-first:15.96 18:02:08 INFO - 2015-11-11 18:02:08,412 DEBUG : BROWSER_OUTPUT: Values: 187.0 168.0 196.0 205.0 166.0 188.0 189.0 169.0 201.0 166.0 18:02:08 INFO - 2015-11-11 18:02:08,413 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,413 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:207.30 Median:208.00 stddev:4.16 (2.0%) stddev-sans-first:4.06 18:02:08 INFO - 2015-11-11 18:02:08,413 DEBUG : BROWSER_OUTPUT: Values: 212.0 208.0 208.0 208.0 202.0 204.0 210.0 213.0 208.0 200.0 18:02:08 INFO - 2015-11-11 18:02:08,413 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,413 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:99.70 Median:87.00 stddev:23.32 (26.8%) stddev-sans-first:23.74 18:02:08 INFO - 2015-11-11 18:02:08,413 DEBUG : BROWSER_OUTPUT: Values: 81.0 92.0 105.0 155.0 83.0 91.0 91.0 89.0 125.0 85.0 18:02:08 INFO - 2015-11-11 18:02:08,413 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,414 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:125.10 Median:114.50 stddev:21.63 (18.9%) stddev-sans-first:21.68 18:02:08 INFO - 2015-11-11 18:02:08,414 DEBUG : BROWSER_OUTPUT: Values: 105.0 109.0 161.0 112.0 114.0 114.0 154.0 114.0 115.0 153.0 18:02:08 INFO - 2015-11-11 18:02:08,414 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,414 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:151.90 Median:153.00 stddev:4.72 (3.1%) stddev-sans-first:4.96 18:02:08 INFO - 2015-11-11 18:02:08,414 DEBUG : BROWSER_OUTPUT: Values: 150.0 151.0 157.0 157.0 155.0 150.0 150.0 150.0 157.0 142.0 18:02:08 INFO - 2015-11-11 18:02:08,414 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,414 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:162.60 Median:164.00 stddev:3.53 (2.2%) stddev-sans-first:3.71 18:02:08 INFO - 2015-11-11 18:02:08,415 DEBUG : BROWSER_OUTPUT: Values: 164.0 164.0 165.0 165.0 156.0 165.0 164.0 164.0 156.0 163.0 18:02:08 INFO - 2015-11-11 18:02:08,415 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,415 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:134.10 Median:134.50 stddev:0.88 (0.7%) stddev-sans-first:0.83 18:02:08 INFO - 2015-11-11 18:02:08,415 DEBUG : BROWSER_OUTPUT: Values: 133.0 134.0 135.0 135.0 134.0 135.0 134.0 135.0 133.0 133.0 18:02:08 INFO - 2015-11-11 18:02:08,415 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,415 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:80.50 Median:81.50 stddev:4.88 (6.0%) stddev-sans-first:3.78 18:02:08 INFO - 2015-11-11 18:02:08,415 DEBUG : BROWSER_OUTPUT: Values: 71.0 76.0 79.0 80.0 82.0 83.0 82.0 90.0 81.0 81.0 18:02:08 INFO - 2015-11-11 18:02:08,416 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,416 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:86.20 Median:88.00 stddev:3.39 (3.9%) stddev-sans-first:2.40 18:02:08 INFO - 2015-11-11 18:02:08,416 DEBUG : BROWSER_OUTPUT: Values: 79.0 82.0 84.0 87.0 88.0 89.0 88.0 89.0 88.0 88.0 18:02:08 INFO - 2015-11-11 18:02:08,416 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,416 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:112.50 Median:113.00 stddev:2.51 (2.2%) stddev-sans-first:1.69 18:02:08 INFO - 2015-11-11 18:02:08,416 DEBUG : BROWSER_OUTPUT: Values: 107.0 112.0 114.0 111.0 112.0 117.0 113.0 113.0 113.0 113.0 18:02:08 INFO - 2015-11-11 18:02:08,417 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,417 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:172.10 Median:173.50 stddev:5.00 (2.9%) stddev-sans-first:5.29 18:02:08 INFO - 2015-11-11 18:02:08,417 DEBUG : BROWSER_OUTPUT: Values: 173.0 171.0 175.0 173.0 175.0 162.0 174.0 166.0 180.0 172.0 18:02:08 INFO - 2015-11-11 18:02:08,417 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,417 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:193.20 Median:198.50 stddev:8.78 (4.4%) stddev-sans-first:8.32 18:02:08 INFO - 2015-11-11 18:02:08,417 DEBUG : BROWSER_OUTPUT: Values: 182.0 201.0 200.0 204.0 197.0 179.0 195.0 200.0 188.0 186.0 18:02:08 INFO - 2015-11-11 18:02:08,418 DEBUG : BROWSER_OUTPUT: 18:02:08 INFO - 2015-11-11 18:02:08,418 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:91.40 Median:93.00 stddev:3.89 (4.2%) stddev-sans-first:2.19 18:02:08 INFO - 2015-11-11 18:02:08,418 DEBUG : BROWSER_OUTPUT: Values: 82.0 88.0 91.0 93.0 94.0 93.0 92.0 92.0 96.0 93.0 18:02:08 INFO - 2015-11-11 18:02:08,418 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:02:08 INFO - 2015-11-11 18:02:08,418 DEBUG : BROWSER_OUTPUT: 18:02:09 INFO - 2015-11-11 18:02:09,178 INFO : Browser exited with error code: 0 18:02:09 INFO - 2015-11-11 18:02:09,236 INFO : Completed test kraken (00:01:04) 18:02:09 INFO - 2015-11-11 18:02:09,236 INFO : Starting test v8_7 18:02:09 INFO - 2015-11-11 18:02:09,236 DEBUG : operating with platform_type : mac_ 18:02:09 INFO - 2015-11-11 18:02:09,237 INFO : Initialising browser for v8_7 test... 18:02:09 INFO - 2015-11-11 18:02:09,252 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/tmpDkNHvn/profile http://localhost:49330/getInfo.html 18:02:12 INFO - 2015-11-11 18:02:12,693 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 18:02:12 INFO - 2015-11-11 18:02:12,693 DEBUG : BROWSER_OUTPUT: colorDepth:24 18:02:12 INFO - 2015-11-11 18:02:12,693 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 18:02:12 INFO - 2015-11-11 18:02:12,694 DEBUG : BROWSER_OUTPUT: __metrics 18:02:13 INFO - 2015-11-11 18:02:13,499 INFO : Browser initialized. 18:02:13 INFO - 2015-11-11 18:02:13,499 INFO : Running cycle 1/1 for v8_7 test... 18:02:13 INFO - 2015-11-11 18:02:13,500 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/T/tmpDkNHvn/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 18:02:25 INFO - 2015-11-11 18:02:25,901 DEBUG : BROWSER_OUTPUT: RSS: Main: 239702016 18:02:25 INFO - 2015-11-11 18:02:25,901 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,502 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49330/tests/v8_7/run.html (next: http://localhost:49330/tests/v8_7/run.html) 18:02:48 INFO - 2015-11-11 18:02:48,751 DEBUG : BROWSER_OUTPUT: RSS: Main: 260104192 18:02:48 INFO - 2015-11-11 18:02:48,751 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,751 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:02:48 INFO - 2015-11-11 18:02:48,751 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:02:48 INFO - 2015-11-11 18:02:48,751 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:02:48 INFO - 2015-11-11 18:02:48,751 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:02:48 INFO - 2015-11-11 18:02:48,752 DEBUG : BROWSER_OUTPUT: |0;Richards;200.08003201280513 18:02:48 INFO - 2015-11-11 18:02:48,752 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;239.40627244433804 18:02:48 INFO - 2015-11-11 18:02:48,752 DEBUG : BROWSER_OUTPUT: |2;Encrypt;407.000407000407 18:02:48 INFO - 2015-11-11 18:02:48,752 DEBUG : BROWSER_OUTPUT: |3;Decrypt;7142.857142857143 18:02:48 INFO - 2015-11-11 18:02:48,752 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1384.508990318119 18:02:48 INFO - 2015-11-11 18:02:48,752 DEBUG : BROWSER_OUTPUT: |5;Earley;942.5070688030161 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: |6;Boyer;15378.787878787878 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: |7;RegExp;35385.9649122807 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: |8;Splay;833.3333333333334 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;6937.931034482759 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: __startTimestamp1447293768748__endTimestamp 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: Number of tests: 10 18:02:48 INFO - 2015-11-11 18:02:48,753 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:200.08 Median:200.08 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: Values: 200.1 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:239.41 Median:239.41 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: Values: 239.4 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:407.00 Median:407.00 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: Values: 407.0 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:7142.86 Median:7142.86 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,754 DEBUG : BROWSER_OUTPUT: Values: 7142.9 18:02:48 INFO - 2015-11-11 18:02:48,755 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,755 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1384.51 Median:1384.51 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,755 DEBUG : BROWSER_OUTPUT: Values: 1384.5 18:02:48 INFO - 2015-11-11 18:02:48,755 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,755 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:942.51 Median:942.51 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,755 DEBUG : BROWSER_OUTPUT: Values: 942.5 18:02:48 INFO - 2015-11-11 18:02:48,755 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,755 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:15378.79 Median:15378.79 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,756 DEBUG : BROWSER_OUTPUT: Values: 15378.8 18:02:48 INFO - 2015-11-11 18:02:48,756 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,756 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:35385.96 Median:35385.96 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,756 DEBUG : BROWSER_OUTPUT: Values: 35386.0 18:02:48 INFO - 2015-11-11 18:02:48,756 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,756 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:833.33 Median:833.33 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,756 DEBUG : BROWSER_OUTPUT: Values: 833.3 18:02:48 INFO - 2015-11-11 18:02:48,757 DEBUG : BROWSER_OUTPUT: 18:02:48 INFO - 2015-11-11 18:02:48,757 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:6937.93 Median:6937.93 stddev:0.00 (0.0%) 18:02:48 INFO - 2015-11-11 18:02:48,757 DEBUG : BROWSER_OUTPUT: Values: 6937.9 18:02:48 INFO - 2015-11-11 18:02:48,757 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:02:48 INFO - 2015-11-11 18:02:48,757 DEBUG : BROWSER_OUTPUT: 18:02:49 INFO - 2015-11-11 18:02:49,511 INFO : Browser exited with error code: 0 18:02:49 INFO - 2015-11-11 18:02:49,536 INFO : Completed test v8_7 (00:00:40) 18:02:49 INFO - 2015-11-11 18:02:49,718 INFO : Completed test suite (00:20:18) 18:02:49 INFO - 2015-11-11 18:02:49,718 DEBUG : Working with test: dromaeo_css 18:02:49 INFO - 2015-11-11 18:02:49,718 DEBUG : Generating results file: dromaeo_css 18:02:49 INFO - 2015-11-11 18:02:49,719 DEBUG : Working with test: kraken 18:02:49 INFO - 2015-11-11 18:02:49,719 DEBUG : Generating results file: kraken 18:02:49 INFO - 2015-11-11 18:02:49,719 INFO : javascript benchmark 18:02:49 INFO - 2015-11-11 18:02:49,719 DEBUG : Working with test: v8_7 18:02:49 INFO - 2015-11-11 18:02:49,719 DEBUG : Generating results file: v8_7 18:02:49 INFO - 2015-11-11 18:02:49,720 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:02:49 INFO - 2015-11-11 18:02:49,782 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,57]] 18:02:49 INFO - 2015-11-11 18:02:49,782 DEBUG : process_Request line: dromaeo_css 5587.62 graph.html#tests=[[72,64,57]] 18:02:49 INFO - 2015-11-11 18:02:49,782 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:02:49 INFO - 2015-11-11 18:02:49,806 DEBUG : process_Request line: kraken 1938.80 graph.html#tests=[[232,64,57]] 18:02:49 INFO - 2015-11-11 18:02:49,806 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:02:49 INFO - 2015-11-11 18:02:49,837 DEBUG : process_Request line: v8_7 16008.80 graph.html#tests=[[230,64,57]] 18:02:49 INFO - 2015-11-11 18:02:49,838 INFO : javascript benchmark 18:02:49 INFO - 2015-11-11 18:02:49,840 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [272.04105528013764, 273.451729282788, 274.1569673254741, 274.8653159951624, 281.10748373912827, 11211.551537938472, 13932.860671393282, 14383.784243236347, 14478.855211447895, 14812.407503699838, 14352.56942291733, 14445.711085778277, 15370.615734606641, 15836.683266334667, 16031.438899638515, 4774.928376074362, 4847.369841920563, 5022.874428139289, 5087.694738315695, 5095.261187127864, 5081.898362032757, 5098.184290513518, 5105.285260063594, 5151.639385243035, 5169.534741873231, 3514.595821480537, 3719.2375563009655, 4967.254911763228, 5011.924821127686, 5444.428335024825, 5611.7474713637985, 5637.943620563783, 5687.857803554903, 5696.458836410535, 5706.1440783882335, 5344.011357898801, 5370.43610420904, 5374.086405311106, 5399.62202645815, 5430.782768689248, 18421.263149474005, 18657.160427780782, 18832.717509237373, 18894.716579251322, 19076.0, 1616.2161351744394, 1676.2624445244053, 1732.4542769027842, 1775.2100315359671, 1829.826166514179, 11021.724456888562, 11528.654140375802, 11793.528258869721, 11855.822162667568, 12314.753704925852, 1427.1365823676733, 1490.6422458609964, 1573.8976966497141, 1631.796025496813, 1654.024125765804, 54519.0, 54540.0, 54723.9999999996, 55591.722041389534, 56067.15899261514, 14091.71816563663, 14187.077839940577, 14220.786688199685, 14307.57077287683, 14446.783298250535, 19861.801381986283, 20059.899700501403, 20081.096350664255, 20187.596248074955, 20270.189192432434, 8215.055268644062, 8215.712450064219, 8259.628316725762, 8293.543855087908, 8328.583570821556, 6971.965140174369, 7015.36861682451, 7049.330313620198, 7054.858902821915, 7117.0, 6666.500012499082, 6706.26231114577, 6757.966210168917, 6800.721758210956, 6931.480138989596, 2693.2189664997322, 2779.722027797204, 2782.7217278272415, 2793.0, 2803.2711495011445, 316.291507024264, 324.5715655334935, 326.9558609587675, 338.8746163919316, 341.142027800083, 8118.715844945516, 8615.91384086151, 8666.739997800076, 8671.56642167889, 8724.171203735636, 332.0702034303939, 338.81195936255614, 341.3241781273044, 342.33757678891425, 345.09240696966816, 4499.797509112098, 4785.569298763128, 5057.570106540985, 5260.815871444481, 5434.8913021739345, 426524.0, 439460.0, 443805.0, 450292.0, 453864.0, 57719.0, 57752.422475775544, 59076.7046164775, 60243.0, 61037.38962610317, 392.94302326162546, 408.8589436644293, 409.5331322292589, 410.9137081212979, 414.06421487438604, 8675.783105422162, 8917.152870477294, 8988.820223595361, 9007.954960225157, 9129.954350228207, 25344.746552534238, 26311.21066368012, 27196.456070878077, 28041.719582804726, 28492.57261141043, 36663.450048248764, 36738.448923266704, 36794.0, 36895.0, 37163.6283637171, 5061.848144555669, 5112.0, 5123.666961647481, 5152.5854831418965, 5214.270002199771, 9685.951570242103, 9747.317687761788, 9819.312648114848, 9827.950860245654, 9901.504924753877, 7737.6518056686455, 8141.511509309224, 8557.700480483154, 8634.870476942977, 8639.95680021596, 8276.0, 8278.751637450887, 8334.333253339597, 8374.35968986057, 8479.279261262862, 8548.786280343042, 8559.614817333111, 8593.52735599548, 8653.913460865311, 8736.650533978824, 4961.603071754179, 5080.695158290514, 5083.898322033612, 5102.948970510248, 5104.668196567211, 8321.6671333146, 8447.746567602982, 8512.063672995842, 8586.22723954847, 8633.30933525304], "dojo.html": [2511.7362676918924, 2562.8974841006357, 2589.145581957955, 2637.301115204471, 2643.6563246777914, 4411.911761764767, 4478.776061196943, 4485.058137791059, 4544.477385100715, 4632.374629425027, 4329.93505097423, 4382.386465894777, 4423.712458690191, 4453.265211240149, 4507.166174257764, 4158.4386107875425, 4214.915701685964, 4264.211120942636, 4282.764447955361, 4330.761808100569, 453.2796492248169, 4104.384342348641, 4193.350030745224, 4247.511536173333, 4312.05134870328, 4059.9594004060173, 4131.566185550504, 4160.54234034256, 4196.81114349855, 4209.3054645983375, 4206.284931561642, 4210.5578914213875, 4239.554846741079, 4266.296061149907, 4288.31386978082, 3973.6821054315587, 4104.794760262005, 4130.0294430808735, 4270.210011147948, 4279.315309550489, 4252.425922500484, 4320.243957307459, 4479.776011199427, 4509.526499717548, 4534.8186072557055, 4778.665493415462, 4780.976095119537, 4854.878628034292, 4869.780859861315, 4924.433690125646, 4682.438107427097, 4710.458297295786, 4761.738104404257, 4833.3958255218095, 4833.782479788418, 4511.323301504768, 4531.365608814768, 4555.430571178603, 4582.312653102062, 4600.447946246439, 4883.853484395474, 4932.1122198004705, 4943.307936888838, 5014.423341315795, 5025.949740502621, 4554.84058057973, 4601.24079526881, 4703.270992996091, 4739.715617062987, 4782.904341913142, 4739.454962679267, 4872.512748725099, 4872.756362181947, 4921.138800709861, 4951.752412379366, 4659.603933665609, 4742.644301677388, 4765.26138448541, 4824.8793780155775, 4836.613070954386, 4576.794044268016, 4667.579917807414, 4691.601213896857, 4695.154872123051, 4704.341392205094, 3609.675129238381, 3672.761270517408, 3681.1349332906743, 3682.0978860179425, 3714.7399682022537, 3240.3195328980705, 3331.950020749691, 3358.445856433661, 3387.356402283558, 3407.812570308607, 4402.801873915681, 4417.315316126005, 4459.44256967879, 4470.821167153343, 4522.23122069249, 4763.8332658357485, 4824.34871292378, 4839.612830973514, 4847.684900481528, 4907.362042934467, 4295.269804133305, 4320.416743739618, 4380.386745855582, 4483.21543729846, 4509.0, 4171.0, 4236.5763423658, 4242.490901091827, 4289.292266775947, 4289.335153051282, 4889.657723959289, 4960.057589058068, 4967.205247160509, 4971.577415919687, 5037.4458809530925, 4618.653600979873, 4695.906081878275, 4733.952660473351, 4807.471178170468, 4831.758412079453, 4959.876003099951, 5001.57486613642, 5009.624278179078, 5010.323606313101, 5080.542751152266, 4777.4505931818285, 4797.520247975314, 4813.180464384241, 4837.975810120927, 4887.633427493023, 4625.907481850411, 4734.360861283682, 4782.473927868002, 4814.013127308824, 4820.71075735457, 4600.470945841137, 4651.488336283074, 4741.5021422750115, 4755.548222918817, 4800.087983283165, 4543.0, 4742.502037286174, 4756.667033307774, 4758.262469317261, 4777.761111944319, 4449.844255451044, 4481.574250446332, 4511.661625378044, 4565.246734288805, 4580.0610874771255, 4716.528347165256, 4719.74041427711, 4722.976385118052, 4729.219678752967, 4780.498047704941, 4403.537628549085, 4604.8388306409115, 4649.930251046169, 4688.882777930579, 4750.12122757291], "mootools.html": [1430.563678078186, 1444.57385071404, 1454.4691187716487, 1481.9629509262268, 1525.8321584625692, 5794.217780599618, 5827.242458480391, 6353.809385718424, 6544.934550654492, 6549.0, 6157.876842463148, 6234.906476402846, 6397.296297407293, 6406.743730250784, 6447.54867159299, 1808.4393837910225, 1810.6650269700083, 1832.8075552067041, 1846.2153584726505, 1847.7136043913215, 1826.205600563759, 1850.4263678259783, 1861.0229629444514, 1872.541227399289, 1884.3404808317048, 1833.62410705805, 1858.9163487643089, 1859.395696398669, 1863.30126202674, 1896.7534220551308, 1764.2061072517354, 1785.4732853808027, 1789.2842862854832, 1791.4894255137224, 1813.9002354870477, 1782.7593274907852, 1788.2131861980688, 1797.3080364059801, 1797.9820201797945, 1815.0743121008381, 6432.935670643327, 6504.479641628658, 6537.869242615168, 6569.244536878225, 6618.966905165444, 3891.1633998690418, 3992.0, 4012.6388625023887, 4057.371107478316, 4103.2409004334295, 2124.702541644171, 2154.6983422320886, 2387.2002879035545, 2437.463757973243, 2481.5781317175943, 721.5093736259341, 729.8868675355276, 737.9483436159471, 739.970401183952, 763.2062654838961, 8713.738587842376, 8717.389782715212, 8777.64889404423, 8823.514706691129, 8940.105989401072, 3626.7461277710836, 3626.9093272668392, 3644.890653280406, 3646.872359467406, 3650.8174591270863, 7584.696612135453, 7585.886211706828, 7637.083549974039, 7745.690172393154, 7755.185705500954, 4040.8585699500377, 4050.10897602527, 4051.39229115635, 4066.7153299268766, 4079.347304431336, 3647.1976165243605, 3668.559772827278, 3672.761270517408, 3692.723045771524, 3729.347364211252, 3077.061496243667, 3109.5024796032526, 3111.797733147338, 3113.252819323346, 3133.702298281705, 1021.371856308365, 1024.6106479537877, 1033.617561502249, 1035.891231420705, 1059.2426415113077, 900.8108297257518, 903.3766700976305, 904.1771987491351, 904.674317245791, 1065.912768975656, 6095.085737139376, 6154.138420621117, 6181.072839074085, 6246.656433896089, 6253.999360102453, 346.88899552143073, 364.0806962419911, 367.82712125301066, 370.0397468569059, 371.9702423806089, 4715.504871988392, 4791.0, 4805.735684537384, 4861.465238823726, 4874.902501949941, 7149.714011439484, 7177.0, 7669.194734552903, 7728.22717728234, 7738.2261773822165, 7601.809954751065, 7645.541267523967, 7660.463767536219, 7714.228577142241, 7730.342920851678, 5937.406259374028, 5951.672658003851, 6029.939700603026, 6073.96963015191, 6130.570860039755, 5856.033754430471, 5896.823095307148, 5902.881942361215, 5921.052631578927, 5957.046872500379, 6598.802035938929, 6692.063111164343, 6743.022261771917, 6871.072405225231, 6973.163220413583, 7027.9297207027275, 7038.577685338896, 7053.0830991970715, 7072.893906591303, 7100.254473280438, 5595.440455954535, 5627.971860140673, 5639.6334238274385, 5644.3508996465935, 5706.229658995982, 6158.168647232746, 6169.383061693795, 6186.659733714689, 6217.09852071438, 6253.718582663882, 5477.561795056306, 5547.500724934614, 5708.6574805510145, 5726.312842458931, 5960.284765828128, 5536.114221724505, 5555.138953462219, 5583.0787919992745, 5608.074667679787, 5644.238027866186, 5579.051561234519, 5602.579806514609, 5630.7466164023535, 5653.208550802973, 5723.942760572341, 5237.7119258439625, 5238.633295669267, 5240.266362709148, 5254.710990895537, 5318.228856815817, 5159.716215608178, 5249.448807875118, 5296.894062118659, 5315.601329900195, 5340.706261155674], "ext.html": [430.91597138557995, 451.25542854290416, 457.1747994869262, 480.12377411224514, 484.7818481683239, 31177.532337014934, 31841.203969900707, 31887.84056079722, 31948.20129496764, 32461.350772984555, 34021.48967765479, 34232.48651270233, 34573.0, 34732.0, 34908.825455872684, 7489.9251007489775, 7659.272369124924, 7667.693292268331, 7718.807029824243, 7732.226777322279, 7503.137139228977, 7541.622918854063, 7555.357794587467, 7684.0, 7712.267334603203, 7512.286332798402, 7583.962080189619, 7585.658645360944, 7588.0, 7781.027371578552, 7620.809479763023, 7632.427567932399, 7640.388768898475, 7656.042994625672, 7657.846843063107, 7428.257174282582, 7450.739224127129, 7495.812604684872, 7594.772156835304, 7689.846203075907, 31888.521672174935, 31919.840400797846, 31944.201394965312, 31955.680443195502, 31995.040148795575, 2117.872927624332, 2231.6456138773588, 2386.4391867911027, 2455.0793452455327, 2592.0, 21457.0, 21972.340829775134, 22330.218442354602, 22504.0, 23276.883615581814, 1941.2914286285545, 1945.5914258005835, 1981.6532106881239, 2000.339887837025, 2012.6578481658007, 191131.0, 191403.0, 192392.0, 194526.0547394522, 196001.0, 42577.36133957993, 43739.78130109329, 44833.0, 45098.0, 45203.0, 48247.0, 48325.51674483281, 48970.77573060702, 49834.25248621274, 50041.0, 12768.489260429664, 12939.0, 12961.351932403342, 12968.481260749464, 13103.672408189872, 9881.703548893545, 9910.256730745079, 10020.749481262881, 10085.899141008642, 10101.393916365041, 14358.641033974025, 14462.349194286073, 14693.706125877423, 14998.100113993196, 15337.386504539694, 6339.0, 6604.471642268607, 6617.172853393326, 6623.701933413008, 6671.899921501182, 784.8979632647719, 794.2216627704767, 858.2533196119416, 893.8078313162702, 951.2912879904516, 22629.773702263097, 22861.542769144857, 22964.770352296262, 23088.769112308997, 23190.884045579664, 871.8474267003376, 883.9558022098869, 891.2869704236584, 904.3624244907325, 981.6956743409565, 11671.766564668658, 11813.940930295465, 11833.763324733458, 11837.0, 11877.287362758263, 251102.0, 252641.0, 253073.0, 255184.0, 256692.0, 42664.36003459951, 43052.569474305485, 43113.13773724508, 43159.35260971088, 43591.56408435939, 938.7371535969803, 947.1333729637305, 947.9099485549, 948.9525523723786, 1102.818035024228, 22244.555108897406, 22736.65895011543, 22754.089836406358, 22759.86200689992, 22822.201222957116, 36973.6302636981, 37403.625963740014, 37868.431973519866, 38098.61901381062, 38252.80873595614, 224854.0, 225224.0, 227200.0, 227889.0, 228808.0, 24567.0, 25537.616935745606, 25589.232323030337, 25611.231663050137, 25847.353816154748, 30740.538891916192, 31086.22284442907, 31096.844515777277, 31369.8431507841, 31685.04944851658, 27113.1866044019, 27585.0, 28120.578191327557, 28261.434771304048, 28338.574921375784, 27755.44489110247, 27877.58183627288, 28314.433711325248, 28574.142775716762, 28603.713962860103, 28303.433931320847, 28484.572731408633, 28537.714622853506, 28578.142655720363, 28625.856870716347, 24714.876425617756, 25176.74823251744, 25185.244442666015, 25488.362790930376, 25571.488570228863, 19317.227310907405, 19479.415617531497, 19543.70684439706, 19892.403227903185, 19900.60198795987], "prototype.html": [251.7608272141465, 257.4233716475096, 266.28768045478347, 266.5508617978705, 267.8928428628548, 4957.454679985203, 5017.1220036493605, 5026.773795179217, 5078.669886457377, 5132.846014619558, 4897.265410188474, 5006.874828129298, 5080.720560369178, 5109.0803655342115, 5117.283580298761, 3957.7427467214684, 3959.6634286085646, 3974.960250397488, 3995.0811313397935, 4001.0, 3996.6203210695085, 4000.6999475039343, 4008.639222469977, 4023.4769479967563, 4036.374361973884, 3938.4289278054666, 3948.2498325318243, 3968.127012057357, 3969.3053715599654, 3978.124812541236, 3774.9056273593105, 3893.0, 3908.7850168240734, 3919.980400097981, 3921.4706014687936, 3316.121227874591, 3326.5176549400444, 3343.749218808599, 3350.145712843234, 3359.5968483781858, 4899.387576552931, 4947.579455746266, 4947.604191664658, 4978.87552811179, 5034.993001399698, 4244.172386384656, 4267.295896177127, 4298.914021719548, 4304.0, 4304.375865499485, 5295.708736019517, 5296.576273898079, 5298.496642818965, 5307.708076055816, 5355.839324820262, 3478.286951175028, 3504.8422820972864, 3536.964630353715, 3558.4128618777872, 3570.9107272318142, 5392.676439413609, 5477.287952566181, 5580.023495888244, 5632.9436705632825, 5634.3520495143175, 3542.4686297055646, 3564.7861128332383, 3597.5862775780597, 3602.7750564807566, 3625.456181572785, 3640.9453858192146, 3647.0335361129323, 3676.522052133259, 3698.389765688631, 3709.3137769512728, 4258.723182993158, 4280.293751531025, 4293.205756934977, 4312.353147027971, 4321.762303073298, 5215.374155101412, 5353.357597088374, 5384.057789886754, 5392.676439413648, 5413.323334583177, 1282.3203702037936, 1304.4977683591885, 1325.516186591887, 1336.0580790542645, 1345.7712188927906, 836.8535506286497, 846.8687353460224, 853.487907255654, 858.1118542308681, 862.0302160069921, 5025.623078269145, 5046.1926091825135, 5084.13569693153, 5131.589472842164, 5182.4299327073995, 5499.422560631157, 5541.168824676251, 5558.583106267046, 5580.860478487989, 5592.356878958891, 5028.396592408934, 5067.442581316052, 5074.873128171826, 5117.590592752571, 5119.564836988898, 2945.9852700736787, 3058.8929387471776, 3066.601341825593, 3071.5699802027734, 3088.336007758343, 5638.379778224392, 5673.035583950738, 5727.4845263926445, 5741.511971482387, 5765.1928729977835, 5419.485148910847, 5600.27196464457, 5622.409646987089, 5664.773409063674, 5690.2887139107615, 5595.916061259084, 5667.773289068474, 5716.628419152742, 5719.57103217252, 5763.0, 5366.785328586813, 5453.372862120907, 5490.423505531861, 5551.0, 5557.083081291542, 5353.491418315254, 5354.7858085676135, 5380.3274590676165, 5400.891982160256, 5452.59105567092, 5438.428964958623, 5713.314402271754, 5826.329972053268, 5834.18321435008, 5863.413658634103, 3641.453781932731, 3656.6526180012856, 3660.707143428466, 3677.191017976041, 3679.638533742532, 5538.584606154474, 5589.720513974366, 5628.521575666115, 5635.746391412315, 5656.971715141398, 5270.0, 5376.354837419378, 5398.1093119634825, 5478.260434841245, 5479.369872464717, 5320.920186197288, 5322.33470816148, 5342.252084708066, 5346.385165705994, 5409.107497263065, 5184.092783762751, 5203.24552939814, 5239.187925871496, 5252.816151434681, 5253.448387919213, 5313.203019547099, 5318.946810531846, 5373.274607928036, 5409.404965453718, 5426.565874730091, 5079.492050794891, 5288.629795914249, 5355.70543620089, 5363.168708850135, 5396.703181324908], "yui.html": [524.556749546633, 589.7051474262869, 607.4654304212293, 617.1637431280612, 632.5414074795774, 10913.563457461692, 11132.443377831116, 11336.319820810757, 11343.829842552368, 11378.601748938789, 11737.765244695102, 11863.288202707843, 11930.761384772299, 12042.337671428068, 12070.577529786458, 550.4715473145785, 703.6657587645878, 704.6300692136643, 705.964701764911, 711.1999001123736, 555.9833205003856, 684.5721424109931, 696.3036963036963, 702.1609177033447, 706.0715159565156, 692.1382878316477, 694.6839188169396, 709.5813470052668, 721.9639018049103, 722.3679280629449, 701.5580184483769, 701.6982697440098, 701.8912068629371, 719.8344380792395, 722.5917356693451, 505.07319069507497, 517.6040329148204, 518.1036806325042, 530.9275263966765, 536.4554976698654, 11229.60696375631, 11373.715657108556, 11375.488103035383, 11396.601118960796, 11416.71458213543, 7743.615583016109, 7799.766007019798, 7945.523268603844, 7995.760127196135, 8292.917070829275, 6980.267071957473, 7119.03892974447, 7154.856902861914, 7189.784306470814, 7564.092308922965, 2369.2418426103654, 2410.529946660402, 2466.7903228225623, 2487.2786891801356, 2583.2239589547758, 39284.80357598194, 39577.60422395768, 39841.40237896463, 40095.0, 40118.59881401178, 5269.288646032813, 5615.747291371898, 5632.324121105494, 5635.267415236075, 5814.273215848019, 9908.603655853829, 10013.899861001442, 10066.144377727975, 10109.747256318651, 10163.28856980019, 5158.432572417031, 5169.276301317818, 5172.094883395391, 5262.815801446931, 5273.2617433559335, 3031.5604237385455, 3034.514477683604, 3132.6554079051284, 3215.6302025266928, 3270.9509357359657, 2256.8081713054244, 2260.299307214736, 2261.434641339665, 2279.6922415474032, 2290.6220473621665, 337.3068344551969, 343.24314885677023, 349.1498201878384, 355.4100193678481, 356.2127697787866, 414.7677300711551, 469.84495116611436, 476.82357527714277, 502.274213761119, 513.4813838023623, 5634.464725851038, 6308.495320374359, 6315.115883776275, 6395.904061439082, 6701.564398314094, 366.49789787990625, 485.5266115537394, 486.05073895519297, 490.23033836876476, 504.08256972310045, 2746.2722378569697, 3043.8325892075704, 3086.845657717105, 3113.2372568720807, 3187.346593948235, 48777.268340974915, 48972.755136224805, 52235.47764522382, 52548.0, 52834.47165528373, 43089.78455107704, 43814.78092609517, 44076.77961610236, 44460.77769611196, 44791.0, 40341.193176136316, 40807.591924080974, 41017.179656406704, 41738.79130604328, 41795.7910210447, 6171.197744293213, 6484.935150648433, 6488.221413430419, 6528.0, 6612.867742645217, 29707.55438668465, 30493.74027338551, 30512.08463746091, 30522.0, 30913.69086309108, 36400.453993190655, 39974.0, 39990.200195995334, 40161.1967760649, 40759.59240407558, 6042.728077236447, 6049.364816694359, 6167.969160154171, 6239.407256310643, 6501.869962600627, 8975.910240897507, 9062.0, 9185.127412895765, 9191.448513089235, 9254.629814807333, 8453.535055572003, 8543.615537300711, 8629.56852157377, 8629.56852157377, 8648.178423050053, 8588.914110858812, 8638.17937295956, 8694.391392602458, 8772.078931712334, 8789.0, 7880.724174653859, 8354.62404191825, 8498.957505212435, 8604.268637165911, 8642.22220000203, 7077.964610176916, 7518.887216691644, 7680.078390593165, 7782.221777822172, 7955.9204407957495, 7177.820554486179, 7479.214682458482, 7535.208803075599, 7572.81067973283, 7641.2740789624895]}, "summary": {"lowerIsBetter": false, "suite": 5587.624605382658, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 6853.297956003532, "unit": "ms", "value": 6853.297956003532}, "dojo.html": {"lowerIsBetter": false, "filtered": 4413.8084794168235, "unit": "ms", "value": 4413.8084794168235}, "mootools.html": {"lowerIsBetter": false, "filtered": 3600.869462460007, "unit": "ms", "value": 3600.869462460007}, "ext.html": {"lowerIsBetter": false, "filtered": 14622.664374307582, "unit": "ms", "value": 14622.664374307582}, "prototype.html": {"lowerIsBetter": false, "filtered": 4004.2430001891594, "unit": "ms", "value": 4004.2430001891594}, "yui.html": {"lowerIsBetter": false, "filtered": 4771.453805774927, "unit": "ms", "value": 4771.453805774927}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0040.e"}, "testrun": {"date": 1447292551, "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": "20151111160710", "branch": "Fx-Team", "revision": "e4d573fb1fc1864531bc84c1a57ce61b79b9c076"}}, {"talos_counters": {}, "results": {"audio-dft": [212.0, 208.0, 208.0, 208.0, 202.0, 204.0, 210.0, 213.0, 208.0, 200.0], "ai-astar": [136.0, 131.0, 142.0, 140.0, 141.0, 152.0, 139.0, 133.0, 133.0, 140.0], "imaging-gaussian-blur": [150.0, 151.0, 157.0, 157.0, 155.0, 150.0, 150.0, 150.0, 157.0, 142.0], "audio-beat-detection": [187.0, 168.0, 196.0, 205.0, 166.0, 188.0, 189.0, 169.0, 201.0, 166.0], "json-stringify-tinderbox": [79.0, 82.0, 84.0, 87.0, 88.0, 89.0, 88.0, 89.0, 88.0, 88.0], "stanford-crypto-pbkdf2": [182.0, 201.0, 200.0, 204.0, 197.0, 179.0, 195.0, 200.0, 188.0, 186.0], "json-parse-financial": [71.0, 76.0, 79.0, 80.0, 82.0, 83.0, 82.0, 90.0, 81.0, 81.0], "stanford-crypto-sha256-iterative": [82.0, 88.0, 91.0, 93.0, 94.0, 93.0, 92.0, 92.0, 96.0, 93.0], "audio-fft": [81.0, 92.0, 105.0, 155.0, 83.0, 91.0, 91.0, 89.0, 125.0, 85.0], "imaging-darkroom": [164.0, 164.0, 165.0, 165.0, 156.0, 165.0, 164.0, 164.0, 156.0, 163.0], "stanford-crypto-ccm": [173.0, 171.0, 175.0, 173.0, 175.0, 162.0, 174.0, 166.0, 180.0, 172.0], "audio-oscillator": [105.0, 109.0, 161.0, 112.0, 114.0, 114.0, 154.0, 114.0, 115.0, 153.0], "stanford-crypto-aes": [107.0, 112.0, 114.0, 111.0, 112.0, 117.0, 113.0, 113.0, 113.0, 113.0], "imaging-desaturate": [133.0, 134.0, 135.0, 135.0, 134.0, 135.0, 134.0, 135.0, 133.0, 133.0]}, "summary": {"lowerIsBetter": true, "suite": 1938.8, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 99.7, "unit": "ms", "value": 99.7}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 193.2, "unit": "ms", "value": 193.2}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 183.5, "unit": "ms", "value": 183.5}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 172.1, "unit": "ms", "value": 172.1}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 162.6, "unit": "ms", "value": 162.6}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 80.5, "unit": "ms", "value": 80.5}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 125.1, "unit": "ms", "value": 125.1}, "ai-astar": {"lowerIsBetter": true, "filtered": 138.7, "unit": "ms", "value": 138.7}, "audio-dft": {"lowerIsBetter": true, "filtered": 207.3, "unit": "ms", "value": 207.3}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 91.4, "unit": "ms", "value": 91.4}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 86.2, "unit": "ms", "value": 86.2}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 151.9, "unit": "ms", "value": 151.9}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 112.5, "unit": "ms", "value": 112.5}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 134.1, "unit": "ms", "value": 134.1}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0040.e"}, "testrun": {"date": 1447292551, "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": "20151111160710", "branch": "Fx-Team", "revision": "e4d573fb1fc1864531bc84c1a57ce61b79b9c076"}}, {"talos_counters": {}, "results": {"DeltaBlue": [239.40627244433804], "Encrypt": [407.000407000407], "NavierStokes": [6937.931034482759], "Decrypt": [7142.857142857143], "Splay": [833.3333333333334], "Richards": [200.08003201280513], "RegExp": [35385.9649122807], "Earley": [942.5070688030161], "Boyer": [15378.787878787878], "RayTrace": [1384.508990318119]}, "summary": {"lowerIsBetter": false, "suite": 16008.802753661868, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 276.1748860000001, "unit": "score", "value": 276.1748860000001}, "Encrypt": {"lowerIsBetter": false, "filtered": 654.0067170000003, "unit": "score", "value": 654.0067170000003}, "NavierStokes": {"lowerIsBetter": false, "filtered": 213.89662027832998, "unit": "score", "value": 213.89662027832998}, "Decrypt": {"lowerIsBetter": false, "filtered": 37.26534000000002, "unit": "score", "value": 37.26534000000002}, "Splay": {"lowerIsBetter": false, "filtered": 97.78920000000001, "unit": "score", "value": 97.78920000000001}, "RegExp": {"lowerIsBetter": false, "filtered": 25.744246405552797, "unit": "score", "value": 25.744246405552797}, "Richards": {"lowerIsBetter": false, "filtered": 176.43939600000002, "unit": "score", "value": 176.43939600000002}, "Earley": {"lowerIsBetter": false, "filtered": 707.1172429999999, "unit": "score", "value": 707.1172429999999}, "Boyer": {"lowerIsBetter": false, "filtered": 43.336510344827595, "unit": "score", "value": 43.336510344827595}, "RayTrace": {"lowerIsBetter": false, "filtered": 534.4775694305696, "unit": "score", "value": 534.4775694305696}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0040.e"}, "testrun": {"date": 1447292551, "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": "20151111160710", "branch": "Fx-Team", "revision": "e4d573fb1fc1864531bc84c1a57ce61b79b9c076"}}] 18:02:49 INFO - RETURN: dromaeo_css: 5587.62 18:02:49 INFO - RETURN: kraken: 1938.80 18:02:49 INFO - RETURN: v8_7: 16008.80 18:02:49 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,57]]", "result": "16008.80"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,57]]", "result": "1938.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,57]]", "result": "5587.62"}}} 18:02:49 INFO - Return code: 0 18:02:49 INFO - # TBPL SUCCESS # 18:02:49 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 18:02:49 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 18:02:49 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 18:02:49 INFO - 2015-11-11 18:02:49.964 screenresolution[1965:12041] starting screenresolution argv=screenresolution get 18:02:49 INFO - 2015-11-11 18:02:49.967 screenresolution[1965:12041] Display 0: 1600x1200x32@60 18:02:49 INFO - 2015-11-11 18:02:49.974 screenresolution[1966:12044] starting screenresolution argv=screenresolution list 18:02:49 INFO - Available Modes on Display 0 18:02:49 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 18:02:49 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 18:02:49 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 18:02:49 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 18:02:50 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 18:02:50 INFO - Intel HD Graphics 3000: 18:02:50 INFO - Chipset Model: Intel HD Graphics 3000 18:02:50 INFO - Type: GPU 18:02:50 INFO - Bus: Built-In 18:02:50 INFO - VRAM (Total): 512 MB 18:02:50 INFO - VRAM (Dynamic, Max): 10 18:02:50 INFO - Vendor: Intel (0x8086) 18:02:50 INFO - Device ID: 0x0116 18:02:50 INFO - Revision ID: 0x0009 18:02:50 INFO - Displays: 18:02:50 INFO - Display: 18:02:50 INFO - Resolution: 1600 x 1200 @ 60 Hz 18:02:50 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 18:02:50 INFO - Display Serial Number: 1600x1200 60 18:02:50 INFO - Main Display: Yes 18:02:50 INFO - Mirror: Off 18:02:50 INFO - Online: Yes 18:02:50 INFO - Rotation: Supported 18:02:50 INFO - Return code: 0 18:02:50 INFO - Running post-action listener: _resource_record_post_action 18:02:50 INFO - Running post-run listener: _resource_record_post_run 18:02:51 INFO - Total resource usage - Wall time: 1262s; CPU: 30.0%; Read bytes: 39555072; Write bytes: 688573440; Read time: 4075; Write time: 65822 18:02:51 INFO - install - Wall time: 43s; CPU: 30.0%; Read bytes: 336538112; Write bytes: 333899776; Read time: 37208; Write time: 5854 18:02:51 INFO - run-tests - Wall time: 1220s; CPU: 30.0%; Read bytes: 39542784; Write bytes: 344310784; Read time: 4051; Write time: 59014 18:02:51 INFO - Running post-run listener: _upload_blobber_files 18:02:51 INFO - Blob upload gear active. 18:02:51 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 18:02:51 INFO - Copying logs to upload dir... 18:02:51 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1316.003005 ========= master_lag: 77.68 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 23 mins, 13 secs) (at 2015-11-11 18:04:09.073316) ========= ========= Started set props: build_url (results: 0, elapsed: 2 secs) (at 2015-11-11 18:04:09.074750) ========= 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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners TMPDIR=/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010824 build_url: 'https://queue.taskcluster.net/v1/task/evpTvts3Q3uwn9oc9nPC2Q/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 2.42 ========= ========= Finished set props: build_url (results: 0, elapsed: 2 secs) (at 2015-11-11 18:04:11.506183) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 18:04:11.506639) ========= 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.9OGnLYvyPW/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.jRgd2NIRPt/Listeners TMPDIR=/var/folders/_z/78cjndc50fnb34chkk5mynfm00000w/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.005624 ========= master_lag: 0.82 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 18:04:12.331148) ========= ========= Started reboot skipped (results: 3, elapsed: 15 secs) (at 2015-11-11 18:04:12.331482) ========= ========= Finished reboot skipped (results: 3, elapsed: 15 secs) (at 2015-11-11 18:04:28.222901) ========= ========= Total master_lag: 81.05 =========