builder: fx-team_yosemite_test-dromaeojs-e10s slave: t-yosemite-r5-0089 starttime: 1447731511.81 results: success (0) buildid: 20151116173404 builduid: 899e92bb053f4ce5abfa77a691605bba revision: ffdc7f22130425020f5d648ef99c10b947541659 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.808140) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.808583) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.808907) ========= 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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners TMPDIR=/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/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.006540 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.833736) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.834064) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.850138) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.850482) ========= 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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners TMPDIR=/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/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.005890 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.899765) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.900062) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.900412) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:31.900695) ========= 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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners TMPDIR=/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/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-16 19:38:31-- 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% 891M=0s 2015-11-16 19:38:32 (891 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.202028 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.118657) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.118967) ========= 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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners TMPDIR=/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/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.021735 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.168481) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.168835) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev ffdc7f22130425020f5d648ef99c10b947541659 --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 ffdc7f22130425020f5d648ef99c10b947541659 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.r5WUpzmyLD/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.SxCb2VhwUx/Listeners TMPDIR=/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/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-16 19:38:32,246 truncating revision to first 12 chars 2015-11-16 19:38:32,246 Setting DEBUG logging. 2015-11-16 19:38:32,246 attempt 1/10 2015-11-16 19:38:32,246 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ffdc7f221304?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-16 19:38:32,504 unpacking tar archive at: fx-team-ffdc7f221304/testing/mozharness/ program finished with exit code 0 elapsedTime=0.525982 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.712868) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.713252) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.727906) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.728237) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-16 19:38:32.728661) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 50 secs) (at 2015-11-16 19:38:32.728945) ========= /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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners TMPDIR=/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0x0:0x0 using PTY: False 19:38:32 INFO - MultiFileLogger online at 20151116 19:38:32 in /builds/slave/test 19:38:32 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 19:38:32 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 19:38:32 INFO - {'append_to_log': False, 19:38:32 INFO - 'base_work_dir': '/builds/slave/test', 19:38:32 INFO - 'blob_upload_branch': 'Fx-Team', 19:38:32 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 19:38:32 INFO - 'branch': 'Fx-Team', 19:38:32 INFO - 'buildbot_json_path': 'buildprops.json', 19:38:32 INFO - 'config_files': ('talos/mac_config.py',), 19:38:32 INFO - 'default_actions': ('clobber', 19:38:32 INFO - 'read-buildbot-config', 19:38:32 INFO - 'download-and-extract', 19:38:32 INFO - 'populate-webroot', 19:38:32 INFO - 'create-virtualenv', 19:38:32 INFO - 'install', 19:38:32 INFO - 'run-tests'), 19:38:32 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:38:32 INFO - 'download_minidump_stackwalk': True, 19:38:32 INFO - 'download_symbols': 'ondemand', 19:38:32 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:38:32 INFO - 'tooltool.py': '/tools/tooltool.py', 19:38:32 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:38:32 INFO - '/tools/misc-python/virtualenv.py')}, 19:38:32 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:38:32 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:38:32 INFO - 'installer_path': 'installer.exe', 19:38:32 INFO - 'log_level': 'info', 19:38:32 INFO - 'log_name': 'talos', 19:38:32 INFO - 'log_to_console': True, 19:38:32 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 19:38:32 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 19:38:32 INFO - 'opt_config_files': (), 19:38:32 INFO - 'pip_index': False, 19:38:32 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 19:38:32 INFO - 'cmd': ('bash', 19:38:32 INFO - '-c', 19:38:32 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 19:38:32 INFO - 'enabled': True, 19:38:32 INFO - 'halt_on_failure': False, 19:38:32 INFO - 'name': 'check_screen_resolution'},), 19:38:32 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 19:38:32 INFO - 'cmd': ('bash', 19:38:32 INFO - '-c', 19:38:32 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 19:38:32 INFO - 'enabled': True, 19:38:32 INFO - 'halt_on_failure': False, 19:38:32 INFO - 'name': 'check_screen_resolution'},), 19:38:32 INFO - 'run_cmd_checks_enabled': True, 19:38:32 INFO - 'sps_profile': False, 19:38:32 INFO - 'sps_profile_interval': 0, 19:38:32 INFO - 'suite': 'dromaeojs-e10s', 19:38:32 INFO - 'system_bits': '64', 19:38:32 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:38:32 INFO - 'title': 't-yosemite-r5-0089', 19:38:32 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:38:32 INFO - 'use_talos_json': True, 19:38:32 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 19:38:32 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:38:32 INFO - 'work_dir': 'build'} 19:38:32 INFO - ##### 19:38:32 INFO - ##### Running clobber step. 19:38:32 INFO - ##### 19:38:32 INFO - Running pre-action listener: _resource_record_pre_action 19:38:32 INFO - Running main action method: clobber 19:38:32 INFO - rmtree: /builds/slave/test/build 19:38:32 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 19:38:34 INFO - Running post-action listener: _resource_record_post_action 19:38:34 INFO - ##### 19:38:34 INFO - ##### Running read-buildbot-config step. 19:38:34 INFO - ##### 19:38:34 INFO - Running pre-action listener: _resource_record_pre_action 19:38:34 INFO - Running main action method: read_buildbot_config 19:38:34 INFO - Using buildbot properties: 19:38:34 INFO - { 19:38:34 INFO - "properties": { 19:38:34 INFO - "buildnumber": 60, 19:38:34 INFO - "product": "firefox", 19:38:34 INFO - "script_repo_revision": "production", 19:38:34 INFO - "builddir": "fx-team_yosemite_test-dromaeojs-e10s", 19:38:34 INFO - "repository": "", 19:38:34 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 fx-team talos dromaeojs-e10s", 19:38:34 INFO - "buildid": "20151116173404", 19:38:34 INFO - "slavename": "t-yosemite-r5-0089", 19:38:34 INFO - "pgo_build": "False", 19:38:34 INFO - "basedir": "/builds/slave/test", 19:38:34 INFO - "project": "", 19:38:34 INFO - "platform": "yosemite", 19:38:34 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 19:38:34 INFO - "slavebuilddir": "test", 19:38:34 INFO - "scheduler": "tests-fx-team-macosx64-talos", 19:38:34 INFO - "branch": "fx-team", 19:38:34 INFO - "repo_path": "integration/fx-team", 19:38:34 INFO - "stage_platform": "macosx64", 19:38:34 INFO - "builduid": "899e92bb053f4ce5abfa77a691605bba", 19:38:34 INFO - "revision": "ffdc7f22130425020f5d648ef99c10b947541659" 19:38:34 INFO - }, 19:38:34 INFO - "sourcestamp": { 19:38:34 INFO - "repository": "", 19:38:34 INFO - "hasPatch": false, 19:38:34 INFO - "project": "", 19:38:34 INFO - "branch": "fx-team-macosx64-talos", 19:38:34 INFO - "changes": [ 19:38:34 INFO - { 19:38:34 INFO - "category": null, 19:38:34 INFO - "files": [ 19:38:34 INFO - { 19:38:34 INFO - "url": null, 19:38:34 INFO - "name": "https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 19:38:34 INFO - } 19:38:34 INFO - ], 19:38:34 INFO - "repository": "", 19:38:34 INFO - "rev": "ffdc7f22130425020f5d648ef99c10b947541659", 19:38:34 INFO - "who": "maglione.k@gmail.com", 19:38:34 INFO - "when": 1447730692, 19:38:34 INFO - "number": 6669781, 19:38:34 INFO - "comments": "Bug 1190321: [webext] Complete test coverage for the browserAction API. r=gabor", 19:38:34 INFO - "project": "", 19:38:34 INFO - "at": "Mon 16 Nov 2015 19:24:52", 19:38:34 INFO - "branch": "fx-team-macosx64-talos", 19:38:34 INFO - "revlink": "", 19:38:34 INFO - "properties": [ 19:38:34 INFO - [ 19:38:34 INFO - "buildid", 19:38:34 INFO - "20151116173404", 19:38:34 INFO - "Change" 19:38:34 INFO - ], 19:38:34 INFO - [ 19:38:34 INFO - "builduid", 19:38:34 INFO - "899e92bb053f4ce5abfa77a691605bba", 19:38:34 INFO - "Change" 19:38:34 INFO - ], 19:38:34 INFO - [ 19:38:34 INFO - "pgo_build", 19:38:34 INFO - "False", 19:38:34 INFO - "Change" 19:38:34 INFO - ] 19:38:34 INFO - ], 19:38:34 INFO - "revision": "ffdc7f22130425020f5d648ef99c10b947541659" 19:38:34 INFO - } 19:38:34 INFO - ], 19:38:34 INFO - "revision": "ffdc7f22130425020f5d648ef99c10b947541659" 19:38:34 INFO - } 19:38:34 INFO - } 19:38:34 INFO - Found installer url https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 19:38:34 INFO - Running post-action listener: _resource_record_post_action 19:38:34 INFO - ##### 19:38:34 INFO - ##### Running download-and-extract step. 19:38:34 INFO - ##### 19:38:34 INFO - Running pre-action listener: _resource_record_pre_action 19:38:34 INFO - Running main action method: download_and_extract 19:38:34 INFO - mkdir: /builds/slave/test/build/tests 19:38: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')]} 19:38:34 INFO - https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 19:38:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/test_packages.json 19:38:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/test_packages.json 19:38:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 19:38:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 19:38:35 INFO - Downloaded 1149 bytes. 19:38:35 INFO - Reading from file /builds/slave/test/build/test_packages.json 19:38:35 INFO - Using the following test package requirements: 19:38:35 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 19:38:35 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:38:35 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 19:38:35 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:38:35 INFO - u'jsshell-mac.zip'], 19:38:35 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:38:35 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 19:38:35 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 19:38:35 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:38:35 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 19:38:35 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:38:35 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 19:38:35 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:38:35 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 19:38:35 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 19:38:35 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 19:38:35 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 19:38:35 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 19:38:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:38:35 INFO - https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 19:38:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:38:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:38:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:38:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 19:38:36 INFO - Downloaded 17460747 bytes. 19:38:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 19:38:36 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:38:36 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 19:38:41 INFO - Return code: 0 19:38:41 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 19:38:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:38:41 INFO - https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 19:38:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:38:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:38:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:38:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 19:38:43 INFO - Downloaded 17460747 bytes. 19:38:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 19:38:43 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 19:38:43 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 19:38:49 INFO - Return code: 0 19:38:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:38:49 INFO - https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 19:38:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 19:38:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 19:38:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 19:38:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 19:38:50 INFO - Downloaded 11131693 bytes. 19:38:50 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 19:38:50 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 19:38:50 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 19:38:50 INFO - Return code: 0 19:38:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:38:50 INFO - https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 19:38:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 19:38:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 19:38:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 19:38:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 19:38:54 INFO - Downloaded 108757865 bytes. 19:38:54 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 19:38:54 INFO - mkdir: /builds/slave/test/properties 19:38:54 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 19:38:54 INFO - Writing to file /builds/slave/test/properties/build_url 19:38:54 INFO - Contents: 19:38:54 INFO - build_url:https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 19:38:54 INFO - Running post-action listener: _resource_record_post_action 19:38:54 INFO - Running post-action listener: set_extra_try_arguments 19:38:54 INFO - ##### 19:38:54 INFO - ##### Running populate-webroot step. 19:38:54 INFO - ##### 19:38:54 INFO - Running pre-action listener: _resource_record_pre_action 19:38:54 INFO - Running main action method: populate_webroot 19:38:54 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:38:54 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:38:54 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 19:38:54 INFO - '../fennec_ids.txt'], 19:38:54 INFO - 'tests': ['tcheck2']}, 19:38:54 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:38:54 INFO - '--tppagecycles', 19:38:54 INFO - '7'], 19:38:54 INFO - 'tests': ['tsvgm']}}, 19:38:54 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 19:38:54 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:38:54 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:38:54 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:38:54 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:38:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:38:54 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:38:54 INFO - 'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:38:54 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:38:54 INFO - 'tests': ['damp', 'tps']}, 19:38:54 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:38:54 INFO - 'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['damp', 'tps']}, 19:38:54 INFO - 'g3': {'tests': ['dromaeo_dom']}, 19:38:54 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:38:54 INFO - 'other': {'tests': ['a11yr', 19:38:54 INFO - 'ts_paint', 19:38:54 INFO - 'tpaint', 19:38:54 INFO - 'sessionrestore', 19:38:54 INFO - 'sessionrestore_no_auto_restore']}, 19:38:54 INFO - 'other-e10s': {'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['a11yr', 19:38:54 INFO - 'ts_paint', 19:38:54 INFO - 'tpaint', 19:38:54 INFO - 'sessionrestore', 19:38:54 INFO - 'sessionrestore_no_auto_restore']}, 19:38:54 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['a11yr', 19:38:54 INFO - 'ts_paint', 19:38:54 INFO - 'tpaint', 19:38:54 INFO - 'sessionrestore', 19:38:54 INFO - 'sessionrestore_no_auto_restore']}, 19:38:54 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['a11yr', 19:38:54 INFO - 'ts_paint', 19:38:54 INFO - 'tpaint', 19:38:54 INFO - 'sessionrestore', 19:38:54 INFO - 'sessionrestore_no_auto_restore']}, 19:38:54 INFO - 'other_l64': {'tests': ['a11yr', 19:38:54 INFO - 'ts_paint', 19:38:54 INFO - 'tpaint', 19:38:54 INFO - 'sessionrestore', 19:38:54 INFO - 'sessionrestore_no_auto_restore']}, 19:38:54 INFO - 'other_nol64': {'tests': ['a11yr', 19:38:54 INFO - 'ts_paint', 19:38:54 INFO - 'tpaint', 19:38:54 INFO - 'sessionrestore', 19:38:54 INFO - 'sessionrestore_no_auto_restore']}, 19:38:54 INFO - 'svgr': {'tests': ['tsvgx', 19:38:54 INFO - 'tsvgr_opacity', 19:38:54 INFO - 'tart', 19:38:54 INFO - 'tscrollx', 19:38:54 INFO - 'cart']}, 19:38:54 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['tsvgx', 19:38:54 INFO - 'tsvgr_opacity', 19:38:54 INFO - 'tart', 19:38:54 INFO - 'tscrollx', 19:38:54 INFO - 'cart']}, 19:38:54 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:38:54 INFO - 'tests': ['tp5o']}, 19:38:54 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:38:54 INFO - 'talos_options': ['--e10s'], 19:38:54 INFO - 'tests': ['tp5o']}, 19:38:54 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:38:54 INFO - 'talos_options': ['--xperf_path', 19:38:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:38:54 INFO - 'tests': ['tp5n']}, 19:38:54 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:38:54 INFO - 'talos_options': ['--e10s', 19:38:54 INFO - '--xperf_path', 19:38:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:38:54 INFO - 'tests': ['tp5n']}}, 19:38:54 INFO - 'talos.zip': {'path': '', 19:38:54 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:38:54 INFO - Running post-action listener: _resource_record_post_action 19:38:54 INFO - ##### 19:38:54 INFO - ##### Running create-virtualenv step. 19:38:54 INFO - ##### 19:38:54 INFO - Running pre-action listener: _resource_record_pre_action 19:38:54 INFO - Running main action method: create_virtualenv 19:38:54 INFO - Creating virtualenv /builds/slave/test/build/venv 19:38:54 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 19:38:54 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 19:38:55 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:38:55 INFO - Using real prefix '/tools/python27' 19:38:55 INFO - New python executable in /builds/slave/test/build/venv/bin/python 19:38:55 INFO - Installing distribute.............................................................................................................................................................................................done. 19:38:59 INFO - Installing pip.................done. 19:38:59 INFO - Return code: 0 19:38:59 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 19:38:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:38:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:38:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:38:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:38:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:38:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:38:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109f00490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109edd228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fef9bd33270>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e239f0>, '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 0x109b83db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109e178c8>, '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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 19:38:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 19:38:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 19:38:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.r5WUpzmyLD/Render', 19:38:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:38:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:38:59 INFO - 'HOME': '/Users/cltbld', 19:38:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:38:59 INFO - 'LOGNAME': 'cltbld', 19:38:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:38:59 INFO - 'MOZ_NO_REMOTE': '1', 19:38:59 INFO - 'NO_EM_RESTART': '1', 19:38:59 INFO - 'PAGER': '/bin/cat', 19:38:59 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:38:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:38:59 INFO - 'PWD': '/builds/slave/test', 19:38:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:38:59 INFO - 'SHELL': '/bin/bash', 19:38:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.SxCb2VhwUx/Listeners', 19:38:59 INFO - 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', 19:38:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:38:59 INFO - 'USER': 'cltbld', 19:38:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:38:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:38:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:38:59 INFO - 'XPC_FLAGS': '0x0', 19:38:59 INFO - 'XPC_SERVICE_NAME': '0', 19:38:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:38:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:38:59 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 19:38:59 INFO - Cleaning up... 19:38:59 INFO - Return code: 0 19:38:59 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 19:38:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:38:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:38:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:38:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:38:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:38:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:38:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x109f00490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109edd228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fef9bd33270>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e239f0>, '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 0x109b83db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109e178c8>, '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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 19:38:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 19:38:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 19:38:59 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.r5WUpzmyLD/Render', 19:38:59 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:38:59 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:38:59 INFO - 'HOME': '/Users/cltbld', 19:38:59 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:38:59 INFO - 'LOGNAME': 'cltbld', 19:38:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:38:59 INFO - 'MOZ_NO_REMOTE': '1', 19:38:59 INFO - 'NO_EM_RESTART': '1', 19:38:59 INFO - 'PAGER': '/bin/cat', 19:38:59 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:38:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:38:59 INFO - 'PWD': '/builds/slave/test', 19:38:59 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:38:59 INFO - 'SHELL': '/bin/bash', 19:38:59 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.SxCb2VhwUx/Listeners', 19:38:59 INFO - 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', 19:38:59 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:38:59 INFO - 'USER': 'cltbld', 19:38:59 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:38:59 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:38:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:38:59 INFO - 'XPC_FLAGS': '0x0', 19:38:59 INFO - 'XPC_SERVICE_NAME': '0', 19:38:59 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:39:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:39:00 INFO - Downloading/unpacking psutil>=0.7.1 19:39:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:02 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 19:39:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 19:39:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 19:39:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:39:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:39:03 INFO - Installing collected packages: psutil 19:39:03 INFO - Running setup.py install for psutil 19:39:03 INFO - building 'psutil._psutil_osx' extension 19:39:03 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 19:39:03 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 19:39:03 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 19:39:03 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 19:39:03 INFO - building 'psutil._psutil_posix' extension 19:39:03 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 19:39:03 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 19:39:03 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 19:39:03 INFO - ^ 19:39:03 INFO - 1 warning generated. 19:39:03 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 19:39:04 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:39:04 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:39:04 INFO - Successfully installed psutil 19:39:04 INFO - Cleaning up... 19:39:04 INFO - Return code: 0 19:39:04 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 19:39:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:39:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:39:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:04 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 0x109f00490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109edd228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fef9bd33270>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e239f0>, '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 0x109b83db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109e178c8>, '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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 19:39:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 19:39:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 19:39:04 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.r5WUpzmyLD/Render', 19:39:04 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:39:04 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:39:04 INFO - 'HOME': '/Users/cltbld', 19:39:04 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:39:04 INFO - 'LOGNAME': 'cltbld', 19:39:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:39:04 INFO - 'MOZ_NO_REMOTE': '1', 19:39:04 INFO - 'NO_EM_RESTART': '1', 19:39:04 INFO - 'PAGER': '/bin/cat', 19:39:04 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:39:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:39:04 INFO - 'PWD': '/builds/slave/test', 19:39:04 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:39:04 INFO - 'SHELL': '/bin/bash', 19:39:04 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.SxCb2VhwUx/Listeners', 19:39:04 INFO - 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', 19:39:04 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:39:04 INFO - 'USER': 'cltbld', 19:39:04 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:39:04 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:39:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:39:04 INFO - 'XPC_FLAGS': '0x0', 19:39:04 INFO - 'XPC_SERVICE_NAME': '0', 19:39:04 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:39:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:39:04 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 19:39:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:07 INFO - Downloading mozsystemmonitor-0.0.tar.gz 19:39:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 19:39:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:39:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 19:39:07 INFO - Installing collected packages: mozsystemmonitor 19:39:07 INFO - Running setup.py install for mozsystemmonitor 19:39:07 INFO - Successfully installed mozsystemmonitor 19:39:07 INFO - Cleaning up... 19:39:07 INFO - Return code: 0 19:39:07 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 19:39:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:39:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:39:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:07 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 0x109f00490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109edd228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fef9bd33270>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e239f0>, '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 0x109b83db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109e178c8>, '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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 19:39:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 19:39:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 19:39:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.r5WUpzmyLD/Render', 19:39:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:39:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:39:07 INFO - 'HOME': '/Users/cltbld', 19:39:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:39:07 INFO - 'LOGNAME': 'cltbld', 19:39:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:39:07 INFO - 'MOZ_NO_REMOTE': '1', 19:39:07 INFO - 'NO_EM_RESTART': '1', 19:39:07 INFO - 'PAGER': '/bin/cat', 19:39:07 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:39:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:39:07 INFO - 'PWD': '/builds/slave/test', 19:39:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:39:07 INFO - 'SHELL': '/bin/bash', 19:39:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.SxCb2VhwUx/Listeners', 19:39:07 INFO - 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', 19:39:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:39:07 INFO - 'USER': 'cltbld', 19:39:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:39:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:39:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:39:07 INFO - 'XPC_FLAGS': '0x0', 19:39:07 INFO - 'XPC_SERVICE_NAME': '0', 19:39:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:39:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:39:07 INFO - Downloading/unpacking blobuploader==1.2.4 19:39:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:10 INFO - Downloading blobuploader-1.2.4.tar.gz 19:39:10 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 19:39:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:39:10 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:39:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 19:39:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 19:39:11 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:39:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:11 INFO - Downloading docopt-0.6.1.tar.gz 19:39:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 19:39:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 19:39:12 INFO - Installing collected packages: blobuploader, requests, docopt 19:39:12 INFO - Running setup.py install for blobuploader 19:39:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:39:12 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 19:39:12 INFO - Running setup.py install for requests 19:39:12 INFO - Running setup.py install for docopt 19:39:13 INFO - Successfully installed blobuploader requests docopt 19:39:13 INFO - Cleaning up... 19:39:13 INFO - Return code: 0 19:39:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:39:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:39:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:39:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:13 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 0x109f00490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109edd228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fef9bd33270>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e239f0>, '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 0x109b83db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109e178c8>, '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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 19:39:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 19:39:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:39:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.r5WUpzmyLD/Render', 19:39:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:39:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:39:13 INFO - 'HOME': '/Users/cltbld', 19:39:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:39:13 INFO - 'LOGNAME': 'cltbld', 19:39:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:39:13 INFO - 'MOZ_NO_REMOTE': '1', 19:39:13 INFO - 'NO_EM_RESTART': '1', 19:39:13 INFO - 'PAGER': '/bin/cat', 19:39:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:39:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:39:13 INFO - 'PWD': '/builds/slave/test', 19:39:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:39:13 INFO - 'SHELL': '/bin/bash', 19:39:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.SxCb2VhwUx/Listeners', 19:39:13 INFO - 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', 19:39:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:39:13 INFO - 'USER': 'cltbld', 19:39:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:39:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:39:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:39:13 INFO - 'XPC_FLAGS': '0x0', 19:39:13 INFO - 'XPC_SERVICE_NAME': '0', 19:39:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:39:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:39:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:39:13 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-0Dt1L3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:39:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:39:13 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-NmXbIA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:39:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:39:13 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-3DPTUr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:39:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:39:13 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-Fdop1g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:39:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:39:14 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-LSa8Tp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:39:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:39:14 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-HinWm4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:39:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:39:14 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-EvlNC5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:39:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:39:14 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-sP7xEf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:39:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:39:14 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-B9ZrZQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:39:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:39:14 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-XbjYXR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:39:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:39:14 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-1nlkCO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:39:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:39:14 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-gw2b3a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:39:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:39:15 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-kPO0qh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:39:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:39:15 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-G7PHHi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:39:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:39:15 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-i7egl5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:39:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:39:15 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-aX8ueW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:39:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:39:15 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-_GDBHG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:39:15 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:39:15 INFO - Running setup.py install for manifestparser 19:39:15 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 19:39:15 INFO - Running setup.py install for mozcrash 19:39:16 INFO - Running setup.py install for mozdebug 19:39:16 INFO - Running setup.py install for mozdevice 19:39:16 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 19:39:16 INFO - Installing dm script to /builds/slave/test/build/venv/bin 19:39:16 INFO - Running setup.py install for mozfile 19:39:16 INFO - Running setup.py install for mozhttpd 19:39:16 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 19:39:16 INFO - Running setup.py install for mozinfo 19:39:17 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 19:39:17 INFO - Running setup.py install for mozInstall 19:39:17 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 19:39:17 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 19:39:17 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 19:39:17 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 19:39:17 INFO - Running setup.py install for mozleak 19:39:17 INFO - Running setup.py install for mozlog 19:39:17 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 19:39:17 INFO - Running setup.py install for moznetwork 19:39:17 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 19:39:17 INFO - Running setup.py install for mozprocess 19:39:18 INFO - Running setup.py install for mozprofile 19:39:18 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 19:39:18 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 19:39:18 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 19:39:18 INFO - Running setup.py install for mozrunner 19:39:18 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 19:39:18 INFO - Running setup.py install for mozscreenshot 19:39:18 INFO - Running setup.py install for moztest 19:39:18 INFO - Running setup.py install for mozversion 19:39:19 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 19:39:19 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:39:19 INFO - Cleaning up... 19:39:19 INFO - Return code: 0 19:39:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:39:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:39:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:39:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/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 0x109f00490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109edd228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fef9bd33270>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e239f0>, '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 0x109b83db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109e178c8>, '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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 19:39:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 19:39:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:39:19 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.r5WUpzmyLD/Render', 19:39:19 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:39:19 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:39:19 INFO - 'HOME': '/Users/cltbld', 19:39:19 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:39:19 INFO - 'LOGNAME': 'cltbld', 19:39:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:39:19 INFO - 'MOZ_NO_REMOTE': '1', 19:39:19 INFO - 'NO_EM_RESTART': '1', 19:39:19 INFO - 'PAGER': '/bin/cat', 19:39:19 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:39:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:39:19 INFO - 'PWD': '/builds/slave/test', 19:39:19 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:39:19 INFO - 'SHELL': '/bin/bash', 19:39:19 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.SxCb2VhwUx/Listeners', 19:39:19 INFO - 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', 19:39:19 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:39:19 INFO - 'USER': 'cltbld', 19:39:19 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:39:19 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:39:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:39:19 INFO - 'XPC_FLAGS': '0x0', 19:39:19 INFO - 'XPC_SERVICE_NAME': '0', 19:39:19 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:39:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:39:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:39:19 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-QkXVBU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:39:19 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 19:39:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:39:19 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-26t0Fz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:39:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:39:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:39:19 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-RU6g4W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:39:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 19:39:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:39:19 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-PpicU_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:39:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:39:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:39:19 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-P4UFMO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:39:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 19:39:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:39:20 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-xW8Y_g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:39:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 19:39:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:39:20 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-D72ZEq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:39:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 19:39:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:39:20 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-ywwsId-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:39:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 19:39:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:39:20 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-ZR2reO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:39:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 19:39:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:39:20 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-bYbCLS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:39:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:39:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:39:20 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-s8qbZW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:39:20 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 19:39:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:39:20 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-ZIyRre-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 19:39:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:39:21 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-Dsi8_x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 19:39:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:39:21 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-RURJrm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 19:39:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:39:21 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-VA992X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 19:39:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:39:21 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-osozVt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 19:39:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:39:21 INFO - Running setup.py (path:/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/pip-SiA2DG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:39:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 19:39:21 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:39:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:39:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:39:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:39:24 INFO - Downloading blessings-1.5.1.tar.gz 19:39:24 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 19:39:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 19:39:24 INFO - Installing collected packages: blessings 19:39:24 INFO - Running setup.py install for blessings 19:39:24 INFO - Successfully installed blessings 19:39:24 INFO - Cleaning up... 19:39:24 INFO - Return code: 0 19:39:24 INFO - Done creating virtualenv /builds/slave/test/build/venv. 19:39:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:39:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:39:25 INFO - Reading from file tmpfile_stdout 19:39:25 INFO - Current package versions: 19:39:25 INFO - blessings == 1.5.1 19:39:25 INFO - blobuploader == 1.2.4 19:39:25 INFO - docopt == 0.6.1 19:39:25 INFO - manifestparser == 1.1 19:39:25 INFO - mozInstall == 1.12 19:39:25 INFO - mozcrash == 0.16 19:39:25 INFO - mozdebug == 0.1 19:39:25 INFO - mozdevice == 0.47 19:39:25 INFO - mozfile == 1.2 19:39:25 INFO - mozhttpd == 0.7 19:39:25 INFO - mozinfo == 0.9 19:39:25 INFO - mozleak == 0.1 19:39:25 INFO - mozlog == 3.0 19:39:25 INFO - moznetwork == 0.27 19:39:25 INFO - mozprocess == 0.22 19:39:25 INFO - mozprofile == 0.27 19:39:25 INFO - mozrunner == 6.11 19:39:25 INFO - mozscreenshot == 0.1 19:39:25 INFO - mozsystemmonitor == 0.0 19:39:25 INFO - moztest == 0.7 19:39:25 INFO - mozversion == 1.4 19:39:25 INFO - psutil == 3.1.1 19:39:25 INFO - requests == 1.2.3 19:39:25 INFO - wsgiref == 0.1.2 19:39:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:39:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:39:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:39:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:39:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:39:25 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 0x109f00490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109edd228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fef9bd33270>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x109e239f0>, '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 0x109b83db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109e178c8>, '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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 19:39:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 19:39:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:39:25 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.r5WUpzmyLD/Render', 19:39:25 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:39:25 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:39:25 INFO - 'HOME': '/Users/cltbld', 19:39:25 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:39:25 INFO - 'LOGNAME': 'cltbld', 19:39:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:39:25 INFO - 'MOZ_NO_REMOTE': '1', 19:39:25 INFO - 'NO_EM_RESTART': '1', 19:39:25 INFO - 'PAGER': '/bin/cat', 19:39:25 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:39:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:39:25 INFO - 'PWD': '/builds/slave/test', 19:39:25 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:39:25 INFO - 'SHELL': '/bin/bash', 19:39:25 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.SxCb2VhwUx/Listeners', 19:39:25 INFO - 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', 19:39:25 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:39:25 INFO - 'USER': 'cltbld', 19:39:25 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:39:25 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:39:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:39:25 INFO - 'XPC_FLAGS': '0x0', 19:39:25 INFO - 'XPC_SERVICE_NAME': '0', 19:39:25 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:39:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 19:39:25 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 19:39:25 INFO - Cleaning up... 19:39:25 INFO - Return code: 0 19:39:25 INFO - Running post-action listener: _resource_record_post_action 19:39:25 INFO - Running post-action listener: _start_resource_monitoring 19:39:25 INFO - Starting resource monitoring. 19:39:25 INFO - ##### 19:39:25 INFO - ##### Running install step. 19:39:25 INFO - ##### 19:39:25 INFO - Running pre-action listener: _resource_record_pre_action 19:39:25 INFO - Running main action method: install 19:39:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:39:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:39:25 INFO - Reading from file tmpfile_stdout 19:39:25 INFO - Detecting whether we're running mozinstall >=1.0... 19:39:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 19:39:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 19:39:26 INFO - Reading from file tmpfile_stdout 19:39:26 INFO - Output received: 19:39:26 INFO - Usage: mozinstall [options] installer 19:39:26 INFO - Options: 19:39:26 INFO - -h, --help show this help message and exit 19:39:26 INFO - -d DEST, --destination=DEST 19:39:26 INFO - Directory to install application into. [default: 19:39:26 INFO - "/builds/slave/test"] 19:39:26 INFO - --app=APP Application being installed. [default: firefox] 19:39:26 INFO - mkdir: /builds/slave/test/build/application 19:39:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 19:39:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 19:40:06 INFO - Reading from file tmpfile_stdout 19:40:06 INFO - Output received: 19:40:06 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 19:40:06 INFO - Running post-action listener: _resource_record_post_action 19:40:06 INFO - ##### 19:40:06 INFO - ##### Running run-tests step. 19:40:06 INFO - ##### 19:40:06 INFO - Running pre-action listener: _resource_record_pre_action 19:40:06 INFO - Running main action method: run_tests 19:40:06 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 19:40:06 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 19:40:06 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 19:40:06 INFO - 2015-11-16 19:40:06.844 screenresolution[2318:74567] starting screenresolution argv=screenresolution get 19:40:06 INFO - 2015-11-16 19:40:06.848 screenresolution[2318:74567] Display 0: 1600x1200x32@60 19:40:06 INFO - 2015-11-16 19:40:06.855 screenresolution[2319:74569] starting screenresolution argv=screenresolution list 19:40:06 INFO - Available Modes on Display 0 19:40:06 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 19:40:06 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 19:40:06 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 19:40:06 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 19:40:07 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 19:40:07 INFO - Intel HD Graphics 3000: 19:40:07 INFO - Chipset Model: Intel HD Graphics 3000 19:40:07 INFO - Type: GPU 19:40:07 INFO - Bus: Built-In 19:40:07 INFO - VRAM (Total): 512 MB 19:40:07 INFO - VRAM (Dynamic, Max): 10 19:40:07 INFO - Vendor: Intel (0x8086) 19:40:07 INFO - Device ID: 0x0116 19:40:07 INFO - Revision ID: 0x0009 19:40:07 INFO - Displays: 19:40:07 INFO - Display: 19:40:07 INFO - Resolution: 1600 x 1200 @ 60 Hz 19:40:07 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 19:40:07 INFO - Display Serial Number: 1600x1200 60 19:40:07 INFO - Main Display: Yes 19:40:07 INFO - Mirror: Off 19:40:07 INFO - Online: Yes 19:40:07 INFO - Rotation: Supported 19:40:07 INFO - Return code: 0 19:40:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 19:40:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 19:40:07 INFO - Python 2.7.3 19:40:07 INFO - Return code: 0 19:40:07 INFO - grabbing minidump binary from tooltool 19:40:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:40:07 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 0x109e239f0>, '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 0x109b83db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x109e178c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 19:40:07 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 19:40:07 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 19:40:07 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:40:07 INFO - Return code: 0 19:40:07 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 19:40:07 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 19:40:07 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 19:40:07 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 19:40:07 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 19:40:07 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/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0089', '--webServer', 'localhost'] in /builds/slave/test/build 19:40:07 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/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0089 --webServer localhost 19:40:07 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.r5WUpzmyLD/Render', 19:40:07 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 19:40:07 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 19:40:07 INFO - 'HOME': '/Users/cltbld', 19:40:07 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 19:40:07 INFO - 'LOGNAME': 'cltbld', 19:40:07 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 19:40:07 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 19:40:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:40:07 INFO - 'MOZ_NO_REMOTE': '1', 19:40:07 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 19:40:07 INFO - 'NO_EM_RESTART': '1', 19:40:07 INFO - 'PAGER': '/bin/cat', 19:40:07 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 19:40:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:40:07 INFO - 'PWD': '/builds/slave/test', 19:40:07 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 19:40:07 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 19:40:07 INFO - 'SHELL': '/bin/bash', 19:40:07 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.SxCb2VhwUx/Listeners', 19:40:07 INFO - 'TMPDIR': '/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/', 19:40:07 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 19:40:07 INFO - 'USER': 'cltbld', 19:40:07 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 19:40:07 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 19:40:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:40:07 INFO - 'XPC_FLAGS': '0x0', 19:40:07 INFO - 'XPC_SERVICE_NAME': '0', 19:40:07 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 19:40:07 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/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0089', '--webServer', 'localhost'] with output_timeout 3600 19:40:07 INFO - mozversion INFO | application_buildid: 20151116173404 19:40:07 INFO - mozversion INFO | application_changeset: ffdc7f22130425020f5d648ef99c10b947541659 19:40:07 INFO - mozversion INFO | application_display_name: Nightly 19:40:07 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:40:07 INFO - mozversion INFO | application_name: Firefox 19:40:07 INFO - mozversion INFO | application_remotingname: firefox 19:40:07 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 19:40:07 INFO - mozversion INFO | application_vendor: Mozilla 19:40:07 INFO - mozversion INFO | application_version: 45.0a1 19:40:07 INFO - mozversion INFO | platform_buildid: 20151116173404 19:40:07 INFO - mozversion INFO | platform_changeset: ffdc7f22130425020f5d648ef99c10b947541659 19:40:07 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 19:40:07 INFO - mozversion INFO | platform_version: 45.0a1 19:40:07 INFO - 2015-11-16 19:40:07,526 DEBUG : using testdate: 1447731607 19:40:07 INFO - 2015-11-16 19:40:07,526 DEBUG : actual date: 1447731607 19:40:07 INFO - 2015-11-16 19:40:07,621 INFO : starting webserver on 'localhost:54379' 19:40:07 INFO - 2015-11-16 19:40:07,623 INFO : Starting test suite t-yosemite-r5-0089.e 19:40:07 INFO - 2015-11-16 19:40:07,623 INFO : Starting test dromaeo_css 19:40:07 INFO - 2015-11-16 19:40:07,623 DEBUG : operating with platform_type : mac_ 19:40:07 INFO - 2015-11-16 19:40:07,624 INFO : Initialising browser for dromaeo_css test... 19:40:07 INFO - 2015-11-16 19:40:07,638 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/tmpKeusmN/profile http://localhost:54379/getInfo.html 19:40:10 INFO - 2015-11-16 19:40:10,913 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:40:10 INFO - 2015-11-16 19:40:10,914 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:40:10 INFO - 2015-11-16 19:40:10,914 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 19:40:10 INFO - 2015-11-16 19:40:10,914 DEBUG : BROWSER_OUTPUT: __metrics 19:40:11 INFO - 2015-11-16 19:40:11,635 INFO : Browser initialized. 19:40:11 INFO - 2015-11-16 19:40:11,635 INFO : Running cycle 1/1 for dromaeo_css test... 19:40:11 INFO - 2015-11-16 19:40:11,636 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/tmpKeusmN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:40:23 INFO - 2015-11-16 19:40:23,857 DEBUG : BROWSER_OUTPUT: RSS: Main: 241156096 19:40:23 INFO - 2015-11-16 19:40:23,857 DEBUG : BROWSER_OUTPUT: 19:41:13 INFO - 2015-11-16 19:41:13,591 DEBUG : BROWSER_OUTPUT: 1447731673588 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 19:43:23 INFO - 2015-11-16 19:43:23,223 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54379/tests/dromaeo/cssquery-ext.html) 19:43:24 INFO - 2015-11-16 19:43:24,329 DEBUG : BROWSER_OUTPUT: RSS: Main: 269230080 19:43:24 INFO - 2015-11-16 19:43:24,329 DEBUG : BROWSER_OUTPUT: 19:46:26 INFO - 2015-11-16 19:46:26,520 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/dromaeo/cssquery-ext.html (next: http://localhost:54379/tests/dromaeo/cssquery-jquery.html) 19:46:27 INFO - 2015-11-16 19:46:27,101 DEBUG : BROWSER_OUTPUT: RSS: Main: 274784256 19:46:27 INFO - 2015-11-16 19:46:27,101 DEBUG : BROWSER_OUTPUT: 19:49:28 INFO - 2015-11-16 19:49:28,939 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54379/tests/dromaeo/cssquery-mootools.html) 19:49:29 INFO - 2015-11-16 19:49:29,526 DEBUG : BROWSER_OUTPUT: RSS: Main: 276860928 19:49:29 INFO - 2015-11-16 19:49:29,527 DEBUG : BROWSER_OUTPUT: 19:52:31 INFO - 2015-11-16 19:52:31,297 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54379/tests/dromaeo/cssquery-prototype.html) 19:52:31 INFO - 2015-11-16 19:52:31,892 DEBUG : BROWSER_OUTPUT: RSS: Main: 282255360 19:52:31 INFO - 2015-11-16 19:52:31,892 DEBUG : BROWSER_OUTPUT: 19:55:34 INFO - 2015-11-16 19:55:34,573 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54379/tests/dromaeo/cssquery-yui.html) 19:55:35 INFO - 2015-11-16 19:55:35,195 DEBUG : BROWSER_OUTPUT: RSS: Main: 287227904 19:55:35 INFO - 2015-11-16 19:55:35,195 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,479 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/dromaeo/cssquery-yui.html (next: http://localhost:54379/tests/dromaeo/cssquery-dojo.html) 19:58:37 INFO - 2015-11-16 19:58:37,738 DEBUG : BROWSER_OUTPUT: RSS: Main: 291868672 19:58:37 INFO - 2015-11-16 19:58:37,738 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,738 DEBUG : BROWSER_OUTPUT: __start_tp_report 19:58:37 INFO - 2015-11-16 19:58:37,738 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 19:58:37 INFO - 2015-11-16 19:58:37,738 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 19:58:37 INFO - 2015-11-16 19:58:37,738 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 19:58:37 INFO - 2015-11-16 19:58:37,740 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2635.235781623329;2705.201965420201;2748.9725102748966;2786.707395723449;2809.7471227589513;4564.680472366931;4644.117617652648;4650.511696271894;4668.859934201971;4690.624750019999;4522.937109779199;4528.320751887219;4545.568171023756;4586.931196032062;4587.449506059277;4196.0558874253275;4216.831326746927;4256.042390462137;4257.297545904922;4295.140971805651;331.0319372769451;4258.5528519505315;4281.935770963438;4341.761203133842;4383.342498625216;4275.337322714984;4304.182205380967;4322.265214913472;4340.913181736363;4342.869713908572;4256.106217694288;4271.572842715735;4321.567843215685;4362;4391.451068616423;4119.0937993641355;4185.560516145822;4204.663626909871;4271.6369108625495;4301.741895486281;4366.19225443294;4498.842540511099;4600.42494688164;4602.401687780601;4621.983163704013;4848.709077455329;4863.805447782084;4883.072216278895;4945.23348880924;5002.524760147817;4818.734969576672;4834.3473631059705;4933.901321973576;4935.679180853233;5020.924686129711;4579.931301030487;4626.236670949255;4634.443866736014;4648.140094082605;4716.905661886777;4873.366462359871;5008.524190201925;5082.288479612857;5098.949010509921;5101.668391554537;4713.6464765142755;4714.15145273854;4759.904801903943;4790.0419916016235;4804.351412559329;4950.257461380822;4953.950460495421;4992.226204938241;5003.324551185543;5012.248162775612;4764.237721964469;4827.468978412442;4881.731504767201;4914.950850491521;4917.459079501252;4741.5021422750115;4769.260764581495;4816.903661926742;4818.445878723922;4827.831025914076;3816.713746469026;3826.311263972456;3842.2507611016144;3881.7670939743707;3889.0083028827466;3398.9830050849587;3399.1502124468884;3442.345954268681;3478.7738796978115;3541.3448512025357;4674.74288914113;4710.6702530823195;4725.598324142417;4759.23852183649;4825.565699087028;4950.43070046942;4976.676516026447;4986.052649996489;5045.571126454219;5103.591712662978;4536.206163921366;4582.816687332469;4634.745089020069;4685.5782979532005;4711.976440117846;4299.462567179103;4312.654987600984;4322.0491491871735;4370.781460927004;4375.693701440932;5027.723475208899;5040.873978150576;5116.8209112681625;5121.820736274212;5125.384953805567;4876.951230487792;4917.164082106122;4927.704337739747;4942.703437793743;4996.3005179274205;5052.797888084436;5117.360329958755;5128.205128205134;5164.457731938092;5164.870878228075;4782.832600859092;4888.364512613338;4895.115306168007;4958.25626156065;4963.181075122564;4868.829590964299;4882.560569548616;4920.015996800583;4932;4963.156263435152;4811.374521312207;4827.758612069452;4872.14737420957;4884.9985752921275;4891;4631.2126938421225;4837.709737415626;4842.564169224786;4858.198397264412;4876.78054487556;4411.602955733999;4461.4869290030765;4550;4589.518100599389;4596.103759766947;4733.621310295237;4842.58837998774;4907.5828554571835;4909.582685471775;4922.4585295616735;4563.201439747964;4596.701214421186;4764.190087685032;4794.376731024944;4825.5174482551465 19:58:37 INFO - 2015-11-16 19:58:37,741 DEBUG : BROWSER_OUTPUT: |1;ext.html;466.9346291519188;481.7663433234881;487.0308086907054;502.861713028917;515.1242887091945;33758.83120584397;34783;34859.65140348596;35028.12429689253;35343.4698479523;37686;38178.42732359017;38204.61795382045;38239.80880095602;38409.8079509602;7973.40199485038;8014.719484818003;8154.3884208684285;8186.672533098698;8225.95887020564;7956.761297161094;7976.202379762007;7977.641006154737;8024.317932975704;8054.838903221932;8012.719554815582;8100.149484304122;8109.270165685087;8114;8147.674093036271;8149.062857771343;8194.836103277901;8196.508209507449;8218.301444377204;8261.83476330476;7856.332211762007;7930.524168549906;7948.284654381134;7982.281594656451;7984.560849153294;34834.30331393383;35385.64614353849;35467.82266088679;35643.4653480198;35754.821225893706;2157.169489746443;2328.8020518255967;2335.866080968788;2496.7378425265447;2712.986435067812;23955.520889582283;24858.5028299433;25159;25538.744612553823;26235.344116397242;2062.855600107993;2078.844086693504;2079.5009197792574;2130.723006009209;2138.925137620176;223264;228380;229124;229227;231836;35545.64454355475;36185.81907090448;36306;36339.27321453556;53917.069122396504;35598.46602300968;35646;35831;35889.64110358863;36143.096422589646;12852.614421567368;12870.034747393984;12880.613581592566;13011.089223754436;13100.934495327463;10208.795824083476;10217.948910255549;10222.693319200436;10250.897491024994;10293.279470436997;12401.13192076546;12413.379331033413;12434.316112613893;12437.93781031089;12482.875171248354;5392.325959255093;5492.231087647732;5525.751341189576;5554.888902221933;5590.496855283044;775.6897241103603;785.6935795039939;852.1733918099434;889.74642226965;991.2417000994245;24437.633435498483;24718.25845224646;26783.330416739736;28248.576271355945;28551.857240713663;882.9514376709215;907.4963395315531;912.4160537256162;974.3033730882312;1064.632701717906;12760.234385936874;12774.68063298425;12876.291803950873;14066.85933140676;14688.192149431883;356980;358101;359581;360077;361637;50940.74529627402;51549.226761598606;51693;51718.22422663663;51802.48197517976;1164.737933964868;1167.6088510349127;1184.763047390508;1199.7060720123452;1209.214010892909;25954.22137335883;26163.607545886447;26207.082752103586;26450.470990580467;26544.203673889813;43673.56326436695;45005.54994450013;45175.548244518446;45443.54556454393;45444.772776135906;251465;251857;251964;252995;253774;36846.815765921;37205.25589488141;38260.51306665058;40244.79877600593;40306.596934031455;37323;37349.81325093357;37538.436923446716;37910.62089379181;38211.61788382081;30935.381292373575;32134.196645083124;32200.838995804872;32239.677603224605;32334.514982274814;33822.926561016044;34340;34988.30023399569;35100.297994040484;35189.64810351864;31470.055898323088;31735.523967140973;32118.518222227154;32143.517847231844;32195.356092877544;27196.32009199786;27204;28332.291692707848;28350.716492835632;28410.289742756595;21272.574548508634;21317.893410532848;21428.571428571653;21538.246161384275;21581.46046348791 19:58:37 INFO - 2015-11-16 19:58:37,744 DEBUG : BROWSER_OUTPUT: |2;jquery.html;281.7562808170933;285.3864191987227;289.7739762984871;290.93744844858355;297.40370557033145;8664.913350866489;8691.86962195566;15061.096334219941;15314.540563783077;15451.690966180684;9906.801863962735;9976.052275033879;10147.238957078212;10204.336718113336;10288.1995650761;3802.5817160112433;3829.827657755394;3902.6487616114546;3915.39311406731;3925.725199236055;2959.837208953507;2964.155215763508;3676.540432445944;4044.4337792709043;4244.0238745088645;4089.447924530195;4153.06556024895;4172.08214192877;4174.728642638234;4179.289520781459;4065.9593404066172;4138.606832350937;4159.355299928516;4169.4162817205615;4196.958030419687;3505.491703702974;3531.8940431787087;3536.469529570559;3548.6806187443253;3559.7330200235087;11258.099352051817;11394.71513212168;11555.53777848885;11631;11639.418029098595;1491.4630732936243;1535.723569757443;1542.0208167813407;1565.0531428485715;1607.6382813866903;7977.282044616012;8020.839583208303;8037.437379383446;8219.219174178443;8238.917610823875;1272.344742457635;1296.4425297122327;1313.1727011982389;1342.2818791946263;1359.1709057474932;44922.55077449249;46344.53655463436;47704.28443573349;47969.76015119937;49436.50563494355;5468.808591699271;5674.943250567524;5687.43125687428;5729.0260655688635;5747.913781293284;6423.389777971085;6443.677816109176;6536.117624120778;6541.738330466728;6545.083688283644;4646.744429056367;4657.67396282257;4659.720416775004;4746.406699162605;4751.667383283206;4962.206047032458;5000.574951129122;5075.111855425286;5081.771320290596;5084.923726144111;2481.317637649661;2519.2316343515035;2522.974770252274;2546.236129161244;2557.9360515986878;891.9018907920124;905.3933864310927;908.52756566585;930.1070971866948;951.9671156794955;336.3541999361232;363.19189802688805;366.48874819626474;383.09016086793866;389.2468074276228;8598.226159645537;8923.866142007875;9345.719628411158;9838.950805246071;10050.296479246528;379.05615018604027;382.831554116188;384.22386778707414;396.98015099244924;406.0944094668846;5475.945240547623;5593.440655934455;5609.158626206102;5626.4017302784;5631.746571404296;485944;493981;497828;500269;503083;57842.4215757837;57946.7102664484;58369.124463133085;58890.41109588935;60427;422.0798658923576;424.54573606241024;425.6594724220611;425.74455326804286;427.94864616245627;9314.345411557673;9347.953260233655;9377;9461.716148515556;9550.808983820423;28014;28891.133266002053;29244.268893277836;29557.2610684726;29875.701242987292;39272.607273928035;39658.80170599128;39864.800675996434;39995.40006899841;40694.79652601836;5348.812791552277;5423.2407462954425;5434.646747961528;5439.5104440600535;5448.782048718007;9636.277279204229;9782.461964592016;9841.704748857546;9931.205503559842;10290.742731431475;8332.250097491255;8733.694320699;8845.778855528662;8946.910530894867;8984.146506081912;8632.309415246891;8681.175288347597;8687.565621718762;8710.956445217733;8882.822343553222;8452.95773521153;8843.336749743923;8986.550672466481;9007.189352958265;9071.863922041042;5299.788008479618;5330.733463326741;5339.439358867263;5414.10667239901;5430.15832545956;8305.750827475185;8690.782730431536;8788.956055219684;8791.736247912573;8988.820223595361 19:58:37 INFO - 2015-11-16 19:58:37,746 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1452.1432354910603;1480.4966311454104;1513.0089791186776;1541.1446647110856;1554.9611259718508;6190;6260.373962603738;6957.234704182542;7102.644867756618;7130.2513236110235;6618.238902526211;6634.70143843527;6842.418394436467;6854.177498700163;6875.759348422806;1910.0736142970613;1919.7408349872799;1922.1542521290587;1947.6591596470632;1954.3257576136211;1918.290232613935;1961.6076784643058;1973.2008536542724;1975.3283883479614;1995;1894.2233684189484;1924.01875043728;1938.3506525314037;1940.5730739237415;1945.3580318494933;1863.3292014874635;1903.8381737552324;1914.3108480946848;1922.5578117033021;1932.7294178814977;1934.9709754353696;1940.7185958036005;1942.417274817549;1954.4136758972393;1980.5048737815546;6831.28271531487;6914.757983470605;6946.895796563055;6977.93022069783;7002.194747603989;4103.384492326145;4202.474690663667;4248.171606536726;4250.553691862372;4275.657947364234;2461.3354394313615;2472.6043832986816;2534.4804315115543;2549.1078122656922;2568.2166939083572;765.3494529649809;767.5049593012532;772.5248971882252;786.5123623353501;797.2266901105918;9248.722538323862;9267.721968341028;9311.44131352121;9336.3464557481;9369.390989585656;3794.5067141271456;3797.468354430382;3802.2585595809105;3847.2690188864026;3858.8070596470066;8081.0706768721175;8112.107668156498;8138.593070346459;8174.141715119946;8217.753467395987;4140.15126898985;4148.771817550064;4160.604742549453;4161.500619925568;4190.53904070552;3353.748468864845;3490.458978858281;3741.663250307431;3778.5843557208686;3797.1076796952693;3144.811311321328;3261;3278.5901762279714;3331.400347937346;3339.7996120232865;1066.1790421375651;1078.8597482327248;1082.821334479802;1095.6055819904827;1107.900288973996;902.8149229407956;911.4030310146865;912.589334799343;954.8281309364243;1140.931544107356;6484.967575162094;6495.577787443801;6591.835204119935;6604.075429439882;6636.568623039487;987.1559816357055;1006.4363956184413;1022.6778564752079;1024.9180065594883;1041.6927006533092;5006.224035274538;5058.671186372874;5081.59347252219;5101.770420331094;5184.533391994739;8044.678212871419;8285.461445006054;8312.25189732927;8316.251537361546;8322.334213262924;8023.117457079717;8121.878171827428;8143.796405089802;8228.21831925966;8294.626741796634;6578;6590.242122155918;6634.502412319095;6636.701348439332;6681.632510211888;6457.773977910751;6510.44661203784;6617.272100069084;6641;6649.301823308677;7161.069061022034;7363.852722945619;7397.741079062207;7502.587357695379;7506.8498630026;7627.351675107456;7641.579713115832;7686.7309644164425;7734.7679569613;7762.88355674654;5466.180072989084;5643.774249030157;5721.828345149652;5773.422657734193;5857.4435428634215;6399.392057754506;6569.605823650596;6583.703733331916;6652.600843949185;6663.800085997428;6171.691415429301;6247.937520624736;6262.718177682106;6314.842128946813;6358.141650877257;6031.5476339273855;6102.237220347457;6186.597871138361;6193;6288.779892703734;6222.533310001859;6293.276273228455;6339.683015849281;6347.650879201688;6371.936280637135;5697.54419646419;5731.312242530923;5735.569832262514;5739.770409183586;5760.884782304247;5786.1899334094105;5804.970975145097;5826.679532625746;5856.12158176277;5904.261967254093 19:58:37 INFO - 2015-11-16 19:58:37,750 DEBUG : BROWSER_OUTPUT: |4;prototype.html;271.5641395560126;272.76950976424916;279.6630060776763;279.986000699965;280.4630624179495;5311.760970756325;5336.946630533694;5484.396716361197;5535.003699334118;5547.167924811275;5487.725613719318;5490.80782172624;5493.395726470095;5537.778488860441;5563.082091454905;4166.729162604436;4202.222588821078;4221.577842215785;4236.703430759848;4236.851710190144;4215.810288537024;4216.430781844458;4224.302990006645;4224.38746381776;4229.450171477703;3931.783751893645;4079.8980025499304;4162.521310049353;4169.895752606179;4190.748555086705;4046.413270075852;4059.675225981929;4067.044244602516;4083.428320035168;4112.876613701564;3459.1697992481622;3476.582810062783;3479.373712731707;3491.30173965208;3503.2117773501013;5155.922661160085;5384.876771472536;5402.459754024605;5403.972980135113;5414.377346605152;4617.12274667812;4626.514216007338;4628.745419001953;4636.814527418899;4664.300354946751;5754.539636829044;5775.537956963432;5779.133130030487;5786.305643322786;5787.135367992829;3800.8859734208017;3806.8667596633986;3808.5429748430365;3820.732548721591;3831.348670725983;5835.737391817378;5985.191999080112;6021.759129634853;6023.849403764897;6024.638521688669;3816.484774555455;3870.4968354113785;3877.1470276539117;3883.2815929053218;3886.5530463997;3921.137349783043;3926.3521518949624;3952.6442620164325;3966.36538153894;3971.801409929492;4559.863204103882;4622.352870598119;4627.444706635225;4630.305454181832;4632.305154226893;5362.946370536322;5502.422245664147;5579.553635709133;5658.74535645897;5662.8301150965535;1352.7970804379224;1371.2047012732592;1374.9037567370387;1383.5365152673967;1387.9444822207;864.7535452396163;866.9219770220584;881.2817553693719;888.8444522208717;892.3173772064376;5565.805196818173;5583.944160558423;5596.2165296858475;5602.207293665988;5613.775448981995;5997.7001149942325;6013.729382177812;6019.909701354483;6030.969845150834;6031.9396806032255;5567.66594004361;5569.610127291132;5574.888502229933;5578.163275508706;5636.746346414339;3159.2733671255282;3230.2570408806105;3248.3990461764647;3253.9511907321407;3264.1275677403733;6156.507479401637;6187.288461826857;6199.3490683478485;6200.131981522591;6203.193584834033;6115.785947491817;6140.140380346755;6146.631202127886;6160.969195153995;6172.69136543171;6017.518598512021;6151.6001459904965;6195.318514963441;6210.7515699372425;6320.936790632035;6030.216071910799;6085.087236914498;6100.938990610037;6119.632822030692;6138.294096178996;5914.467697907209;5930.080837470199;5940.940590594038;5946.197263369563;5949.137375080502;6042.667653279112;6222.253329600477;6224.657643829632;6227.346128656607;6260.40526150015;3858.2090671411734;3893.610638936084;3899.53205615328;3919.47087143232;3925.488686855524;5694.487496125369;5874.118882167709;5975.701214939322;6003.279606447254;6070.939290607037;5690.658560486384;5835.8541036472725;5837.6497410155525;5846.093855452412;5850.0932355484965;5866.413358664099;5869.4717475427415;5871.882562348644;5872.588918775816;5884.47039766423;5611.018071837494;5694.1458781183155;5720.911867168536;5752.9712351437975;5767.307923049261;5841.766329346949;5843.94156058451;5873.471387575139;5878.823635290948;5954.553408494294;5713.085906254979;5746.597738158456;5751.194832723339;5769.307683078057;5771.076627739541 19:58:37 INFO - 2015-11-16 19:58:37,750 DEBUG : BROWSER_OUTPUT: |5;yui.html;537.4007981101068;586.3842964886869;590.9822705318842;621.456225802423;627.0750642801868;9652.951735241322;9916.603335866575;10124.29129960903;10131.138853197477;10159.542820573073;9261.26792596184;9391.389559678617;9468.100530449614;9473.431594104359;9542.0935011174;750.8723517002109;764.6864785437972;765.5827573972199;772.3126417488439;772.8802035684478;752.0449029732237;766.9003029606172;775.592813772771;776.6000509737489;779.9899130625853;791.7149826062613;799.9960000199991;801.1227705662291;802.8233788566536;804.3283857978565;775.2634996753079;789.7157023471545;800.7277525641281;803.6062329458582;804.3926835239386;593.8366949088992;596.588354035714;600.7777122464672;600.8047384600022;602.8643555200089;8616.396852220347;8739.912600873973;8784.60469278884;8807.383483156182;8846.601902914384;8427.957860210721;8483.830323393497;8509.234168924826;8923.955380223122;9083.500407477586;7501.962490187569;7860.056793184797;7874.173211812735;7946.801329966739;8125;2763.6125991424883;2808.185626168409;2811.4939310924024;2848.9287767805763;2887.06170494588;36472;37495.62504374949;37556.43665344995;41295.38056929148;41524.792376038225;5670.206171136044;5709.857253568611;5809.535237181015;5890.734916928748;6110.541709371815;10529.947350263199;10541;10548;10555.47222638865;10591.205659575562;5185.481451854785;5294.735263236823;5300.867478313073;5429.809956651498;5436.320459942507;3080.7073328033803;3084.568160457538;3172.2069482629345;3225.5645487858837;3231.5152727090654;2231.129859354853;2262.7284725833006;2267.6711876778104;2269.4553307206484;2396.484755777516;367.4561648759797;370.69788122679927;371.3371631637514;375.0904057660163;378.5419642232874;427.6749670250632;481.36459872968044;487.256933176901;516.8501134670978;530.8858595402007;6566.474682025522;6980.232174460805;7028.4025857801635;7098.6450677466955;7123.430125590044;384.95188101487315;392.25667360351974;434.7545572302775;478.9128677901145;481.2132163912029;3143.292759129223;3171.8255495947483;3222.646488474846;3225.7580681448985;3251.934961300808;47480.762596186796;48626.756866215444;48771.512284877404;49111.75444122757;52386.21420678693;43529;43705;44705;45264.77367613141;45316.320255196195;35224.29551409009;35237.82381088078;38861.6113838858;40538.18923621511;41450.79274603668;6837.62393068386;6913.51605387618;7017.859642807013;7027.754028608974;7467.439942004263;30706.232344191572;30942.845285773426;31137.844310778302;31722.524162137124;31872.521912170872;39662.2067558653;40307.59692403038;41073.58926410697;41479.7926010368;41519.58480415157;6368.108464814837;6464.644444555594;6632.2372927114;6884.242733299433;6904.3095690430555;9357.438553686801;9397.977941176547;9587.856182157133;9642.71071867845;9688.32181747271;9069.501177435304;9162.67930622425;9201.171894529525;9201.263898888206;9225.308101892519;9060.728178154666;9086.591103400495;9107.590158442754;9121.179093881583;9130;8856.291496680378;8975.730728078168;8984.730458086267;8991.640334386551;8996.730098097067;7800.375969922279;7977.6011199438635;8314.62584183701;8344.123866994121;8366.99536652007;7074.752383666547;7295.817604559928;7442.1069471661585;7619.771406857803;7641.503302285334 19:58:37 INFO - 2015-11-16 19:58:37,750 DEBUG : BROWSER_OUTPUT: __end_tp_report 19:58:37 INFO - 2015-11-16 19:58:37,751 DEBUG : BROWSER_OUTPUT: __start_cc_report 19:58:37 INFO - 2015-11-16 19:58:37,751 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,293 19:58:37 INFO - 2015-11-16 19:58:37,751 DEBUG : BROWSER_OUTPUT: __end_cc_report 19:58:37 INFO - 2015-11-16 19:58:37,751 DEBUG : BROWSER_OUTPUT: __startTimestamp1447732717736__endTimestamp 19:58:37 INFO - 2015-11-16 19:58:37,751 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,751 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 19:58:37 INFO - 2015-11-16 19:58:37,752 DEBUG : BROWSER_OUTPUT: Number of tests: 6 19:58:37 INFO - 2015-11-16 19:58:37,752 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,752 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4567.09 Median:4725.60 stddev:591.93 (12.5%) stddev-sans-first:574.01 19:58:37 INFO - 2015-11-16 19:58:37,753 DEBUG : BROWSER_OUTPUT: Values: 2635.2 2705.2 2749.0 2786.7 2809.7 4564.7 4644.1 4650.5 4668.9 4690.6 4522.9 4528.3 4545.6 4586.9 4587.4 4196.1 4216.8 4256.0 4257.3 4295.1 331.0 4258.6 4281.9 4341.8 4383.3 4275.3 4304.2 4322.3 4340.9 4342.9 4256.1 4271.6 4321.6 4362.0 4391.5 4119.1 4185.6 4204.7 4271.6 4301.7 4366.2 4498.8 4600.4 4602.4 4622.0 4848.7 4863.8 4883.1 4945.2 5002.5 4818.7 4834.3 4933.9 4935.7 5020.9 4579.9 4626.2 4634.4 4648.1 4716.9 4873.4 5008.5 5082.3 5098.9 5101.7 4713.6 4714.2 4759.9 4790.0 4804.4 4950.3 4954.0 4992.2 5003.3 5012.2 4764.2 4827.5 4881.7 4915.0 4917.5 4741.5 4769.3 4816.9 4818.4 4827.8 3816.7 3826.3 3842.3 3881.8 3889.0 3399.0 3399.2 3442.3 3478.8 3541.3 4674.7 4710.7 4725.6 4759.2 4825.6 4950.4 4976.7 4986.1 5045.6 5103.6 4536.2 4582.8 4634.7 4685.6 4712.0 4299.5 4312.7 4322.0 4370.8 4375.7 5027.7 5040.9 5116.8 5121.8 5125.4 4877.0 4917.2 4927.7 4942.7 4996.3 5052.8 5117.4 5128.2 5164.5 5164.9 4782.8 4888.4 4895.1 4958.3 4963.2 4868.8 4882.6 4920.0 4932.0 4963.2 4811.4 4827.8 4872.1 4885.0 4891.0 4631.2 4837.7 4842.6 4858.2 4876.8 4411.6 4461.5 4550.0 4589.5 4596.1 4733.6 4842.6 4907.6 4909.6 4922.5 4563.2 4596.7 4764.2 4794.4 4825.5 19:58:37 INFO - 2015-11-16 19:58:37,753 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,754 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:42370.91 Median:35266.56 stddev:75157.99 (213.1%) stddev-sans-first:75302.97 19:58:37 INFO - 2015-11-16 19:58:37,755 DEBUG : BROWSER_OUTPUT: Values: 466.9 481.8 487.0 502.9 515.1 33758.8 34783.0 34859.7 35028.1 35343.5 37686.0 38178.4 38204.6 38239.8 38409.8 7973.4 8014.7 8154.4 8186.7 8226.0 7956.8 7976.2 7977.6 8024.3 8054.8 8012.7 8100.1 8109.3 8114.0 8147.7 8149.1 8194.8 8196.5 8218.3 8261.8 7856.3 7930.5 7948.3 7982.3 7984.6 34834.3 35385.6 35467.8 35643.5 35754.8 2157.2 2328.8 2335.9 2496.7 2713.0 23955.5 24858.5 25159.0 25538.7 26235.3 2062.9 2078.8 2079.5 2130.7 2138.9 223264.0 228380.0 229124.0 229227.0 231836.0 35545.6 36185.8 36306.0 36339.3 53917.1 35598.5 35646.0 35831.0 35889.6 36143.1 12852.6 12870.0 12880.6 13011.1 13100.9 10208.8 10217.9 10222.7 10250.9 10293.3 12401.1 12413.4 12434.3 12437.9 12482.9 5392.3 5492.2 5525.8 5554.9 5590.5 775.7 785.7 852.2 889.7 991.2 24437.6 24718.3 26783.3 28248.6 28551.9 883.0 907.5 912.4 974.3 1064.6 12760.2 12774.7 12876.3 14066.9 14688.2 356980.0 358101.0 359581.0 360077.0 361637.0 50940.7 51549.2 51693.0 51718.2 51802.5 1164.7 1167.6 1184.8 1199.7 1209.2 25954.2 26163.6 26207.1 26450.5 26544.2 43673.6 45005.5 45175.5 45443.5 45444.8 251465.0 251857.0 251964.0 252995.0 253774.0 36846.8 37205.3 38260.5 40244.8 40306.6 37323.0 37349.8 37538.4 37910.6 38211.6 30935.4 32134.2 32200.8 32239.7 32334.5 33822.9 34340.0 34988.3 35100.3 35189.6 31470.1 31735.5 32118.5 32143.5 32195.4 27196.3 27204.0 28332.3 28350.7 28410.3 21272.6 21317.9 21428.6 21538.2 21581.5 19:58:37 INFO - 2015-11-16 19:58:37,755 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,756 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:23405.67 Median:47837.02 stddev:81196.11 (169.7%) stddev-sans-first:81405.32 19:58:37 INFO - 2015-11-16 19:58:37,756 DEBUG : BROWSER_OUTPUT: Values: 281.8 285.4 289.8 290.9 297.4 8664.9 8691.9 15061.1 15314.5 15451.7 9906.8 9976.1 10147.2 10204.3 10288.2 3802.6 3829.8 3902.6 3915.4 3925.7 2959.8 2964.2 3676.5 4044.4 4244.0 4089.4 4153.1 4172.1 4174.7 4179.3 4066.0 4138.6 4159.4 4169.4 4197.0 3505.5 3531.9 3536.5 3548.7 3559.7 11258.1 11394.7 11555.5 11631.0 11639.4 1491.5 1535.7 1542.0 1565.1 1607.6 7977.3 8020.8 8037.4 8219.2 8238.9 1272.3 1296.4 1313.2 1342.3 1359.2 44922.6 46344.5 47704.3 47969.8 49436.5 5468.8 5674.9 5687.4 5729.0 5747.9 6423.4 6443.7 6536.1 6541.7 6545.1 4646.7 4657.7 4659.7 4746.4 4751.7 4962.2 5000.6 5075.1 5081.8 5084.9 2481.3 2519.2 2523.0 2546.2 2557.9 891.9 905.4 908.5 930.1 952.0 336.4 363.2 366.5 383.1 389.2 8598.2 8923.9 9345.7 9839.0 10050.3 379.1 382.8 384.2 397.0 406.1 5475.9 5593.4 5609.2 5626.4 5631.7 485944.0 493981.0 497828.0 500269.0 503083.0 57842.4 57946.7 58369.1 58890.4 60427.0 422.1 424.5 425.7 425.7 427.9 9314.3 9348.0 9377.0 9461.7 9550.8 28014.0 28891.1 29244.3 29557.3 29875.7 39272.6 39658.8 39864.8 39995.4 40694.8 5348.8 5423.2 5434.6 5439.5 5448.8 9636.3 9782.5 9841.7 9931.2 10290.7 8332.3 8733.7 8845.8 8946.9 8984.1 8632.3 8681.2 8687.6 8711.0 8882.8 8453.0 8843.3 8986.6 9007.2 9071.9 5299.8 5330.7 5339.4 5414.1 5430.2 8305.8 8690.8 8789.0 8791.7 8988.8 19:58:37 INFO - 2015-11-16 19:58:37,756 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,756 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4818.26 Median:6066.89 stddev:2510.22 (41.4%) stddev-sans-first:2504.51 19:58:37 INFO - 2015-11-16 19:58:37,758 DEBUG : BROWSER_OUTPUT: Values: 1452.1 1480.5 1513.0 1541.1 1555.0 6190.0 6260.4 6957.2 7102.6 7130.3 6618.2 6634.7 6842.4 6854.2 6875.8 1910.1 1919.7 1922.2 1947.7 1954.3 1918.3 1961.6 1973.2 1975.3 1995.0 1894.2 1924.0 1938.4 1940.6 1945.4 1863.3 1903.8 1914.3 1922.6 1932.7 1935.0 1940.7 1942.4 1954.4 1980.5 6831.3 6914.8 6946.9 6977.9 7002.2 4103.4 4202.5 4248.2 4250.6 4275.7 2461.3 2472.6 2534.5 2549.1 2568.2 765.3 767.5 772.5 786.5 797.2 9248.7 9267.7 9311.4 9336.3 9369.4 3794.5 3797.5 3802.3 3847.3 3858.8 8081.1 8112.1 8138.6 8174.1 8217.8 4140.2 4148.8 4160.6 4161.5 4190.5 3353.7 3490.5 3741.7 3778.6 3797.1 3144.8 3261.0 3278.6 3331.4 3339.8 1066.2 1078.9 1082.8 1095.6 1107.9 902.8 911.4 912.6 954.8 1140.9 6485.0 6495.6 6591.8 6604.1 6636.6 987.2 1006.4 1022.7 1024.9 1041.7 5006.2 5058.7 5081.6 5101.8 5184.5 8044.7 8285.5 8312.3 8316.3 8322.3 8023.1 8121.9 8143.8 8228.2 8294.6 6578.0 6590.2 6634.5 6636.7 6681.6 6457.8 6510.4 6617.3 6641.0 6649.3 7161.1 7363.9 7397.7 7502.6 7506.8 7627.4 7641.6 7686.7 7734.8 7762.9 5466.2 5643.8 5721.8 5773.4 5857.4 6399.4 6569.6 6583.7 6652.6 6663.8 6171.7 6247.9 6262.7 6314.8 6358.1 6031.5 6102.2 6186.6 6193.0 6288.8 6222.5 6293.3 6339.7 6347.7 6371.9 5697.5 5731.3 5735.6 5739.8 5760.9 5786.2 5805.0 5826.7 5856.1 5904.3 19:58:37 INFO - 2015-11-16 19:58:37,758 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,758 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4809.41 Median:5576.53 stddev:1501.92 (26.9%) stddev-sans-first:1467.01 19:58:37 INFO - 2015-11-16 19:58:37,760 DEBUG : BROWSER_OUTPUT: Values: 271.6 272.8 279.7 280.0 280.5 5311.8 5336.9 5484.4 5535.0 5547.2 5487.7 5490.8 5493.4 5537.8 5563.1 4166.7 4202.2 4221.6 4236.7 4236.9 4215.8 4216.4 4224.3 4224.4 4229.5 3931.8 4079.9 4162.5 4169.9 4190.7 4046.4 4059.7 4067.0 4083.4 4112.9 3459.2 3476.6 3479.4 3491.3 3503.2 5155.9 5384.9 5402.5 5404.0 5414.4 4617.1 4626.5 4628.7 4636.8 4664.3 5754.5 5775.5 5779.1 5786.3 5787.1 3800.9 3806.9 3808.5 3820.7 3831.3 5835.7 5985.2 6021.8 6023.8 6024.6 3816.5 3870.5 3877.1 3883.3 3886.6 3921.1 3926.4 3952.6 3966.4 3971.8 4559.9 4622.4 4627.4 4630.3 4632.3 5362.9 5502.4 5579.6 5658.7 5662.8 1352.8 1371.2 1374.9 1383.5 1387.9 864.8 866.9 881.3 888.8 892.3 5565.8 5583.9 5596.2 5602.2 5613.8 5997.7 6013.7 6019.9 6031.0 6031.9 5567.7 5569.6 5574.9 5578.2 5636.7 3159.3 3230.3 3248.4 3254.0 3264.1 6156.5 6187.3 6199.3 6200.1 6203.2 6115.8 6140.1 6146.6 6161.0 6172.7 6017.5 6151.6 6195.3 6210.8 6320.9 6030.2 6085.1 6100.9 6119.6 6138.3 5914.5 5930.1 5940.9 5946.2 5949.1 6042.7 6222.3 6224.7 6227.3 6260.4 3858.2 3893.6 3899.5 3919.5 3925.5 5694.5 5874.1 5975.7 6003.3 6070.9 5690.7 5835.9 5837.6 5846.1 5850.1 5866.4 5869.5 5871.9 5872.6 5884.5 5611.0 5694.1 5720.9 5753.0 5767.3 5841.8 5843.9 5873.5 5878.8 5954.6 5713.1 5746.6 5751.2 5769.3 5771.1 19:58:37 INFO - 2015-11-16 19:58:37,760 DEBUG : BROWSER_OUTPUT: 19:58:37 INFO - 2015-11-16 19:58:37,760 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11098.43 Median:3366.00 stddev:13806.76 (410.2%) stddev-sans-first:13822.72 19:58:37 INFO - 2015-11-16 19:58:37,760 DEBUG : BROWSER_OUTPUT: Values: 537.4 586.4 591.0 621.5 627.1 9653.0 9916.6 10124.3 10131.1 10159.5 9261.3 9391.4 9468.1 9473.4 9542.1 750.9 764.7 765.6 772.3 772.9 752.0 766.9 775.6 776.6 780.0 791.7 800.0 801.1 802.8 804.3 775.3 789.7 800.7 803.6 804.4 593.8 596.6 600.8 600.8 602.9 8616.4 8739.9 8784.6 8807.4 8846.6 8428.0 8483.8 8509.2 8924.0 9083.5 7502.0 7860.1 7874.2 7946.8 8125.0 2763.6 2808.2 2811.5 2848.9 2887.1 36472.0 37495.6 37556.4 41295.4 41524.8 5670.2 5709.9 5809.5 5890.7 6110.5 10529.9 10541.0 10548.0 10555.5 10591.2 5185.5 5294.7 5300.9 5429.8 5436.3 3080.7 3084.6 3172.2 3225.6 3231.5 2231.1 2262.7 2267.7 2269.5 2396.5 367.5 370.7 371.3 375.1 378.5 427.7 481.4 487.3 516.9 530.9 6566.5 6980.2 7028.4 7098.6 7123.4 385.0 392.3 434.8 478.9 481.2 3143.3 3171.8 3222.6 3225.8 3251.9 47480.8 48626.8 48771.5 49111.8 52386.2 43529.0 43705.0 44705.0 45264.8 45316.3 35224.3 35237.8 38861.6 40538.2 41450.8 6837.6 6913.5 7017.9 7027.8 7467.4 30706.2 30942.8 31137.8 31722.5 31872.5 39662.2 40307.6 41073.6 41479.8 41519.6 6368.1 6464.6 6632.2 6884.2 6904.3 9357.4 9398.0 9587.9 9642.7 9688.3 9069.5 9162.7 9201.2 9201.3 9225.3 9060.7 9086.6 9107.6 9121.2 9130.0 8856.3 8975.7 8984.7 8991.6 8996.7 7800.4 7977.6 8314.6 8344.1 8367.0 7074.8 7295.8 7442.1 7619.8 7641.5 19:58:37 INFO - 2015-11-16 19:58:37,760 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 19:58:37 INFO - 2015-11-16 19:58:37,760 DEBUG : BROWSER_OUTPUT: 19:58:38 INFO - 2015-11-16 19:58:38,442 INFO : Browser exited with error code: 0 19:58:38 INFO - 2015-11-16 19:58:38,476 INFO : Completed test dromaeo_css (00:18:30) 19:58:38 INFO - 2015-11-16 19:58:38,476 INFO : Starting test kraken 19:58:38 INFO - 2015-11-16 19:58:38,476 DEBUG : operating with platform_type : mac_ 19:58:38 INFO - 2015-11-16 19:58:38,476 INFO : Initialising browser for kraken test... 19:58:38 INFO - 2015-11-16 19:58:38,492 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/tmpv5CIVk/profile http://localhost:54379/getInfo.html 19:58:41 INFO - 2015-11-16 19:58:41,676 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:58:41 INFO - 2015-11-16 19:58:41,676 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:58:41 INFO - 2015-11-16 19:58:41,677 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 19:58:41 INFO - 2015-11-16 19:58:41,677 DEBUG : BROWSER_OUTPUT: __metrics 19:58:42 INFO - 2015-11-16 19:58:42,417 INFO : Browser initialized. 19:58:42 INFO - 2015-11-16 19:58:42,418 INFO : Running cycle 1/1 for kraken test... 19:58:42 INFO - 2015-11-16 19:58:42,418 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/tmpv5CIVk/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:58:54 INFO - 2015-11-16 19:58:54,598 DEBUG : BROWSER_OUTPUT: RSS: Main: 241242112 19:58:54 INFO - 2015-11-16 19:58:54,599 DEBUG : BROWSER_OUTPUT: 19:58:57 INFO - 2015-11-16 19:58:57,432 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54379/tests/kraken/driver.html?testName=audio-beat-detection) 19:58:58 INFO - 2015-11-16 19:58:58,041 DEBUG : BROWSER_OUTPUT: RSS: Main: 259616768 19:58:58 INFO - 2015-11-16 19:58:58,041 DEBUG : BROWSER_OUTPUT: 19:59:01 INFO - 2015-11-16 19:59:01,061 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54379/tests/kraken/driver.html?testName=audio-dft) 19:59:01 INFO - 2015-11-16 19:59:01,669 DEBUG : BROWSER_OUTPUT: RSS: Main: 268054528 19:59:01 INFO - 2015-11-16 19:59:01,670 DEBUG : BROWSER_OUTPUT: 19:59:04 INFO - 2015-11-16 19:59:04,950 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54379/tests/kraken/driver.html?testName=audio-fft) 19:59:05 INFO - 2015-11-16 19:59:05,524 DEBUG : BROWSER_OUTPUT: RSS: Main: 267452416 19:59:05 INFO - 2015-11-16 19:59:05,525 DEBUG : BROWSER_OUTPUT: 19:59:07 INFO - 2015-11-16 19:59:07,709 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54379/tests/kraken/driver.html?testName=audio-oscillator) 19:59:08 INFO - 2015-11-16 19:59:08,301 DEBUG : BROWSER_OUTPUT: RSS: Main: 267661312 19:59:08 INFO - 2015-11-16 19:59:08,301 DEBUG : BROWSER_OUTPUT: 19:59:10 INFO - 2015-11-16 19:59:10,681 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54379/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:59:11 INFO - 2015-11-16 19:59:11,255 DEBUG : BROWSER_OUTPUT: RSS: Main: 268197888 19:59:11 INFO - 2015-11-16 19:59:11,255 DEBUG : BROWSER_OUTPUT: 19:59:14 INFO - 2015-11-16 19:59:14,708 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54379/tests/kraken/driver.html?testName=imaging-darkroom) 19:59:15 INFO - 2015-11-16 19:59:15,310 DEBUG : BROWSER_OUTPUT: RSS: Main: 267063296 19:59:15 INFO - 2015-11-16 19:59:15,310 DEBUG : BROWSER_OUTPUT: 19:59:18 INFO - 2015-11-16 19:59:18,873 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54379/tests/kraken/driver.html?testName=imaging-desaturate) 19:59:19 INFO - 2015-11-16 19:59:19,462 DEBUG : BROWSER_OUTPUT: RSS: Main: 266657792 19:59:19 INFO - 2015-11-16 19:59:19,463 DEBUG : BROWSER_OUTPUT: 19:59:22 INFO - 2015-11-16 19:59:22,700 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54379/tests/kraken/driver.html?testName=json-parse-financial) 19:59:23 INFO - 2015-11-16 19:59:23,290 DEBUG : BROWSER_OUTPUT: RSS: Main: 267018240 19:59:23 INFO - 2015-11-16 19:59:23,290 DEBUG : BROWSER_OUTPUT: 19:59:25 INFO - 2015-11-16 19:59:25,015 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54379/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:59:25 INFO - 2015-11-16 19:59:25,591 DEBUG : BROWSER_OUTPUT: RSS: Main: 268247040 19:59:25 INFO - 2015-11-16 19:59:25,591 DEBUG : BROWSER_OUTPUT: 19:59:27 INFO - 2015-11-16 19:59:27,624 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54379/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:59:28 INFO - 2015-11-16 19:59:28,258 DEBUG : BROWSER_OUTPUT: RSS: Main: 267837440 19:59:28 INFO - 2015-11-16 19:59:28,258 DEBUG : BROWSER_OUTPUT: 19:59:30 INFO - 2015-11-16 19:59:30,583 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54379/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:59:31 INFO - 2015-11-16 19:59:31,175 DEBUG : BROWSER_OUTPUT: RSS: Main: 268398592 19:59:31 INFO - 2015-11-16 19:59:31,175 DEBUG : BROWSER_OUTPUT: 19:59:34 INFO - 2015-11-16 19:59:34,138 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54379/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:59:34 INFO - 2015-11-16 19:59:34,742 DEBUG : BROWSER_OUTPUT: RSS: Main: 268320768 19:59:34 INFO - 2015-11-16 19:59:34,742 DEBUG : BROWSER_OUTPUT: 19:59:37 INFO - 2015-11-16 19:59:37,728 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54379/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:59:38 INFO - 2015-11-16 19:59:38,322 DEBUG : BROWSER_OUTPUT: RSS: Main: 268984320 19:59:38 INFO - 2015-11-16 19:59:38,322 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,219 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54379/tests/kraken/driver.html?testName=ai-astar) 19:59:40 INFO - 2015-11-16 19:59:40,478 DEBUG : BROWSER_OUTPUT: RSS: Main: 268206080 19:59:40 INFO - 2015-11-16 19:59:40,479 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,479 DEBUG : BROWSER_OUTPUT: __start_tp_report 19:59:40 INFO - 2015-11-16 19:59:40,479 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 19:59:40 INFO - 2015-11-16 19:59:40,479 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 19:59:40 INFO - 2015-11-16 19:59:40,479 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 19:59:40 INFO - 2015-11-16 19:59:40,479 DEBUG : BROWSER_OUTPUT: |0;ai-astar;127;124;135;133;133;139;129;134;135;134 19:59:40 INFO - 2015-11-16 19:59:40,479 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;183;164;182;196;158;180;181;159;195;159 19:59:40 INFO - 2015-11-16 19:59:40,479 DEBUG : BROWSER_OUTPUT: |2;audio-dft;190;202;213;205;202;199;194;195;205;198 19:59:40 INFO - 2015-11-16 19:59:40,480 DEBUG : BROWSER_OUTPUT: |3;audio-fft;81;91;100;153;82;85;86;87;124;81 19:59:40 INFO - 2015-11-16 19:59:40,480 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;100;104;157;106;110;110;153;107;104;152 19:59:40 INFO - 2015-11-16 19:59:40,480 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;151;142;140;142;143;149;149;148;143;136 19:59:40 INFO - 2015-11-16 19:59:40,480 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;156;156;150;157;156;149;156;157;158;151 19:59:40 INFO - 2015-11-16 19:59:40,480 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;116;130;117;128;121;126;118;122;118;127 19:59:40 INFO - 2015-11-16 19:59:40,480 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;68;72;75;74;75;77;77;84;76;75 19:59:40 INFO - 2015-11-16 19:59:40,480 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;78;83;86;83;88;88;86;87;83;83 19:59:40 INFO - 2015-11-16 19:59:40,481 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;103;107;109;107;107;107;109;106;103;102 19:59:40 INFO - 2015-11-16 19:59:40,481 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;167;155;168;162;161;151;151;161;158;167 19:59:40 INFO - 2015-11-16 19:59:40,481 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;182;196;196;191;186;185;190;194;183;175 19:59:40 INFO - 2015-11-16 19:59:40,481 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;80;84;87;89;88;88;94;87;90;87 19:59:40 INFO - 2015-11-16 19:59:40,481 DEBUG : BROWSER_OUTPUT: __end_tp_report 19:59:40 INFO - 2015-11-16 19:59:40,481 DEBUG : BROWSER_OUTPUT: __start_cc_report 19:59:40 INFO - 2015-11-16 19:59:40,481 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,745 19:59:40 INFO - 2015-11-16 19:59:40,481 DEBUG : BROWSER_OUTPUT: __end_cc_report 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: __startTimestamp1447732780472__endTimestamp 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: Number of tests: 14 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:132.30 Median:134.00 stddev:4.40 (3.3%) stddev-sans-first:4.23 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: Values: 127.0 124.0 135.0 133.0 133.0 139.0 129.0 134.0 135.0 134.0 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:175.70 Median:181.50 stddev:14.65 (8.1%) stddev-sans-first:15.30 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: Values: 183.0 164.0 182.0 196.0 158.0 180.0 181.0 159.0 195.0 159.0 19:59:40 INFO - 2015-11-16 19:59:40,482 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:200.30 Median:202.00 stddev:6.60 (3.3%) stddev-sans-first:5.85 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: Values: 190.0 202.0 213.0 205.0 202.0 199.0 194.0 195.0 205.0 198.0 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:97.00 Median:83.50 stddev:23.60 (28.3%) stddev-sans-first:24.31 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: Values: 81.0 91.0 100.0 153.0 82.0 85.0 86.0 87.0 124.0 81.0 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:120.30 Median:110.00 stddev:23.47 (21.3%) stddev-sans-first:23.72 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: Values: 100.0 104.0 157.0 106.0 110.0 110.0 153.0 107.0 104.0 152.0 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:144.30 Median:145.50 stddev:4.76 (3.3%) stddev-sans-first:4.39 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: Values: 151.0 142.0 140.0 142.0 143.0 149.0 149.0 148.0 143.0 136.0 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:154.60 Median:156.00 stddev:3.27 (2.1%) stddev-sans-first:3.43 19:59:40 INFO - 2015-11-16 19:59:40,483 DEBUG : BROWSER_OUTPUT: Values: 156.0 156.0 150.0 157.0 156.0 149.0 156.0 157.0 158.0 151.0 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:122.30 Median:124.00 stddev:5.10 (4.1%) stddev-sans-first:4.87 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: Values: 116.0 130.0 117.0 128.0 121.0 126.0 118.0 122.0 118.0 127.0 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:75.30 Median:75.50 stddev:4.06 (5.4%) stddev-sans-first:3.33 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: Values: 68.0 72.0 75.0 74.0 75.0 77.0 77.0 84.0 76.0 75.0 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:84.50 Median:86.00 stddev:3.10 (3.6%) stddev-sans-first:2.22 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: Values: 78.0 83.0 86.0 83.0 88.0 88.0 86.0 87.0 83.0 83.0 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:106.00 Median:107.00 stddev:2.49 (2.3%) stddev-sans-first:2.40 19:59:40 INFO - 2015-11-16 19:59:40,484 DEBUG : BROWSER_OUTPUT: Values: 103.0 107.0 109.0 107.0 107.0 107.0 109.0 106.0 103.0 102.0 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:160.10 Median:161.50 stddev:6.31 (3.9%) stddev-sans-first:6.18 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: Values: 167.0 155.0 168.0 162.0 161.0 151.0 151.0 161.0 158.0 167.0 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:187.80 Median:190.50 stddev:6.83 (3.6%) stddev-sans-first:6.91 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: Values: 182.0 196.0 196.0 191.0 186.0 185.0 190.0 194.0 183.0 175.0 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:87.40 Median:88.00 stddev:3.66 (4.2%) stddev-sans-first:2.73 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: Values: 80.0 84.0 87.0 89.0 88.0 88.0 94.0 87.0 90.0 87.0 19:59:40 INFO - 2015-11-16 19:59:40,485 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 19:59:40 INFO - 2015-11-16 19:59:40,486 DEBUG : BROWSER_OUTPUT: 19:59:41 INFO - 2015-11-16 19:59:41,220 INFO : Browser exited with error code: 0 19:59:41 INFO - 2015-11-16 19:59:41,275 INFO : Completed test kraken (00:01:02) 19:59:41 INFO - 2015-11-16 19:59:41,275 INFO : Starting test v8_7 19:59:41 INFO - 2015-11-16 19:59:41,275 DEBUG : operating with platform_type : mac_ 19:59:41 INFO - 2015-11-16 19:59:41,276 INFO : Initialising browser for v8_7 test... 19:59:41 INFO - 2015-11-16 19:59:41,290 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/tmpwgiHKu/profile http://localhost:54379/getInfo.html 19:59:44 INFO - 2015-11-16 19:59:44,415 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:59:44 INFO - 2015-11-16 19:59:44,415 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:59:44 INFO - 2015-11-16 19:59:44,415 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 19:59:44 INFO - 2015-11-16 19:59:44,416 DEBUG : BROWSER_OUTPUT: __metrics 19:59:45 INFO - 2015-11-16 19:59:45,313 INFO : Browser initialized. 19:59:45 INFO - 2015-11-16 19:59:45,313 INFO : Running cycle 1/1 for v8_7 test... 19:59:45 INFO - 2015-11-16 19:59:45,313 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/T/tmpwgiHKu/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:59:57 INFO - 2015-11-16 19:59:57,465 DEBUG : BROWSER_OUTPUT: RSS: Main: 240177152 19:59:57 INFO - 2015-11-16 19:59:57,465 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,124 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:54379/tests/v8_7/run.html (next: http://localhost:54379/tests/v8_7/run.html) 20:00:20 INFO - 2015-11-16 20:00:20,385 DEBUG : BROWSER_OUTPUT: RSS: Main: 256589824 20:00:20 INFO - 2015-11-16 20:00:20,385 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,386 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:00:20 INFO - 2015-11-16 20:00:20,386 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:00:20 INFO - 2015-11-16 20:00:20,386 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:00:20 INFO - 2015-11-16 20:00:20,386 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:00:20 INFO - 2015-11-16 20:00:20,386 DEBUG : BROWSER_OUTPUT: |0;Richards;839.6305625524769 20:00:20 INFO - 2015-11-16 20:00:20,386 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;229.6211251435132 20:00:20 INFO - 2015-11-16 20:00:20,386 DEBUG : BROWSER_OUTPUT: |2;Encrypt;367.5119441381845 20:00:20 INFO - 2015-11-16 20:00:20,387 DEBUG : BROWSER_OUTPUT: |3;Decrypt;6532.467532467533 20:00:20 INFO - 2015-11-16 20:00:20,387 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1302.0833333333333 20:00:20 INFO - 2015-11-16 20:00:20,387 DEBUG : BROWSER_OUTPUT: |5;Earley;1020.4081632653061 20:00:20 INFO - 2015-11-16 20:00:20,387 DEBUG : BROWSER_OUTPUT: |6;Boyer;16225.806451612903 20:00:20 INFO - 2015-11-16 20:00:20,387 DEBUG : BROWSER_OUTPUT: |7;RegExp;33733.333333333336 20:00:20 INFO - 2015-11-16 20:00:20,387 DEBUG : BROWSER_OUTPUT: |8;Splay;788.6557886557887 20:00:20 INFO - 2015-11-16 20:00:20,387 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;6673.333333333333 20:00:20 INFO - 2015-11-16 20:00:20,387 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:00:20 INFO - 2015-11-16 20:00:20,388 DEBUG : BROWSER_OUTPUT: __startTimestamp1447732820378__endTimestamp 20:00:20 INFO - 2015-11-16 20:00:20,388 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,388 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:00:20 INFO - 2015-11-16 20:00:20,388 DEBUG : BROWSER_OUTPUT: Number of tests: 10 20:00:20 INFO - 2015-11-16 20:00:20,388 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,388 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:839.63 Median:839.63 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,388 DEBUG : BROWSER_OUTPUT: Values: 839.6 20:00:20 INFO - 2015-11-16 20:00:20,388 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:229.62 Median:229.62 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: Values: 229.6 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:367.51 Median:367.51 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: Values: 367.5 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:6532.47 Median:6532.47 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: Values: 6532.5 20:00:20 INFO - 2015-11-16 20:00:20,389 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,390 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1302.08 Median:1302.08 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,390 DEBUG : BROWSER_OUTPUT: Values: 1302.1 20:00:20 INFO - 2015-11-16 20:00:20,390 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,390 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:1020.41 Median:1020.41 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,390 DEBUG : BROWSER_OUTPUT: Values: 1020.4 20:00:20 INFO - 2015-11-16 20:00:20,390 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,390 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:16225.81 Median:16225.81 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,391 DEBUG : BROWSER_OUTPUT: Values: 16225.8 20:00:20 INFO - 2015-11-16 20:00:20,391 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,391 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:33733.33 Median:33733.33 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,391 DEBUG : BROWSER_OUTPUT: Values: 33733.3 20:00:20 INFO - 2015-11-16 20:00:20,391 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,391 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:788.66 Median:788.66 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,391 DEBUG : BROWSER_OUTPUT: Values: 788.7 20:00:20 INFO - 2015-11-16 20:00:20,392 DEBUG : BROWSER_OUTPUT: 20:00:20 INFO - 2015-11-16 20:00:20,392 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:6673.33 Median:6673.33 stddev:0.00 (0.0%) 20:00:20 INFO - 2015-11-16 20:00:20,392 DEBUG : BROWSER_OUTPUT: Values: 6673.3 20:00:20 INFO - 2015-11-16 20:00:20,392 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:00:20 INFO - 2015-11-16 20:00:20,392 DEBUG : BROWSER_OUTPUT: 20:00:21 INFO - 2015-11-16 20:00:21,092 INFO : Browser exited with error code: 0 20:00:21 INFO - 2015-11-16 20:00:21,115 INFO : Completed test v8_7 (00:00:39) 20:00:21 INFO - 2015-11-16 20:00:21,274 INFO : Completed test suite (00:20:13) 20:00:21 INFO - 2015-11-16 20:00:21,274 DEBUG : Working with test: dromaeo_css 20:00:21 INFO - 2015-11-16 20:00:21,274 DEBUG : Generating results file: dromaeo_css 20:00:21 INFO - 2015-11-16 20:00:21,275 DEBUG : Working with test: kraken 20:00:21 INFO - 2015-11-16 20:00:21,275 DEBUG : Generating results file: kraken 20:00:21 INFO - 2015-11-16 20:00:21,276 INFO : javascript benchmark 20:00:21 INFO - 2015-11-16 20:00:21,276 DEBUG : Working with test: v8_7 20:00:21 INFO - 2015-11-16 20:00:21,276 DEBUG : Generating results file: v8_7 20:00:21 INFO - 2015-11-16 20:00:21,276 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:00:21 INFO - 2015-11-16 20:00:21,326 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,57]] 20:00:21 INFO - 2015-11-16 20:00:21,326 DEBUG : process_Request line: dromaeo_css 5683.37 graph.html#tests=[[72,64,57]] 20:00:21 INFO - 2015-11-16 20:00:21,326 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:00:21 INFO - 2015-11-16 20:00:21,353 DEBUG : process_Request line: kraken 1847.90 graph.html#tests=[[232,64,57]] 20:00:21 INFO - 2015-11-16 20:00:21,354 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:00:21 INFO - 2015-11-16 20:00:21,382 DEBUG : process_Request line: v8_7 14306.51 graph.html#tests=[[230,64,57]] 20:00:21 INFO - 2015-11-16 20:00:21,383 INFO : javascript benchmark 20:00:21 INFO - 2015-11-16 20:00:21,385 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [281.7562808170933, 285.3864191987227, 289.7739762984871, 290.93744844858355, 297.40370557033145, 8664.913350866489, 8691.86962195566, 15061.096334219941, 15314.540563783077, 15451.690966180684, 9906.801863962735, 9976.052275033879, 10147.238957078212, 10204.336718113336, 10288.1995650761, 3802.5817160112433, 3829.827657755394, 3902.6487616114546, 3915.39311406731, 3925.725199236055, 2959.837208953507, 2964.155215763508, 3676.540432445944, 4044.4337792709043, 4244.0238745088645, 4089.447924530195, 4153.06556024895, 4172.08214192877, 4174.728642638234, 4179.289520781459, 4065.9593404066172, 4138.606832350937, 4159.355299928516, 4169.4162817205615, 4196.958030419687, 3505.491703702974, 3531.8940431787087, 3536.469529570559, 3548.6806187443253, 3559.7330200235087, 11258.099352051817, 11394.71513212168, 11555.53777848885, 11631.0, 11639.418029098595, 1491.4630732936243, 1535.723569757443, 1542.0208167813407, 1565.0531428485715, 1607.6382813866903, 7977.282044616012, 8020.839583208303, 8037.437379383446, 8219.219174178443, 8238.917610823875, 1272.344742457635, 1296.4425297122327, 1313.1727011982389, 1342.2818791946263, 1359.1709057474932, 44922.55077449249, 46344.53655463436, 47704.28443573349, 47969.76015119937, 49436.50563494355, 5468.808591699271, 5674.943250567524, 5687.43125687428, 5729.0260655688635, 5747.913781293284, 6423.389777971085, 6443.677816109176, 6536.117624120778, 6541.738330466728, 6545.083688283644, 4646.744429056367, 4657.67396282257, 4659.720416775004, 4746.406699162605, 4751.667383283206, 4962.206047032458, 5000.574951129122, 5075.111855425286, 5081.771320290596, 5084.923726144111, 2481.317637649661, 2519.2316343515035, 2522.974770252274, 2546.236129161244, 2557.9360515986878, 891.9018907920124, 905.3933864310927, 908.52756566585, 930.1070971866948, 951.9671156794955, 336.3541999361232, 363.19189802688805, 366.48874819626474, 383.09016086793866, 389.2468074276228, 8598.226159645537, 8923.866142007875, 9345.719628411158, 9838.950805246071, 10050.296479246528, 379.05615018604027, 382.831554116188, 384.22386778707414, 396.98015099244924, 406.0944094668846, 5475.945240547623, 5593.440655934455, 5609.158626206102, 5626.4017302784, 5631.746571404296, 485944.0, 493981.0, 497828.0, 500269.0, 503083.0, 57842.4215757837, 57946.7102664484, 58369.124463133085, 58890.41109588935, 60427.0, 422.0798658923576, 424.54573606241024, 425.6594724220611, 425.74455326804286, 427.94864616245627, 9314.345411557673, 9347.953260233655, 9377.0, 9461.716148515556, 9550.808983820423, 28014.0, 28891.133266002053, 29244.268893277836, 29557.2610684726, 29875.701242987292, 39272.607273928035, 39658.80170599128, 39864.800675996434, 39995.40006899841, 40694.79652601836, 5348.812791552277, 5423.2407462954425, 5434.646747961528, 5439.5104440600535, 5448.782048718007, 9636.277279204229, 9782.461964592016, 9841.704748857546, 9931.205503559842, 10290.742731431475, 8332.250097491255, 8733.694320699, 8845.778855528662, 8946.910530894867, 8984.146506081912, 8632.309415246891, 8681.175288347597, 8687.565621718762, 8710.956445217733, 8882.822343553222, 8452.95773521153, 8843.336749743923, 8986.550672466481, 9007.189352958265, 9071.863922041042, 5299.788008479618, 5330.733463326741, 5339.439358867263, 5414.10667239901, 5430.15832545956, 8305.750827475185, 8690.782730431536, 8788.956055219684, 8791.736247912573, 8988.820223595361], "dojo.html": [2635.235781623329, 2705.201965420201, 2748.9725102748966, 2786.707395723449, 2809.7471227589513, 4564.680472366931, 4644.117617652648, 4650.511696271894, 4668.859934201971, 4690.624750019999, 4522.937109779199, 4528.320751887219, 4545.568171023756, 4586.931196032062, 4587.449506059277, 4196.0558874253275, 4216.831326746927, 4256.042390462137, 4257.297545904922, 4295.140971805651, 331.0319372769451, 4258.5528519505315, 4281.935770963438, 4341.761203133842, 4383.342498625216, 4275.337322714984, 4304.182205380967, 4322.265214913472, 4340.913181736363, 4342.869713908572, 4256.106217694288, 4271.572842715735, 4321.567843215685, 4362.0, 4391.451068616423, 4119.0937993641355, 4185.560516145822, 4204.663626909871, 4271.6369108625495, 4301.741895486281, 4366.19225443294, 4498.842540511099, 4600.42494688164, 4602.401687780601, 4621.983163704013, 4848.709077455329, 4863.805447782084, 4883.072216278895, 4945.23348880924, 5002.524760147817, 4818.734969576672, 4834.3473631059705, 4933.901321973576, 4935.679180853233, 5020.924686129711, 4579.931301030487, 4626.236670949255, 4634.443866736014, 4648.140094082605, 4716.905661886777, 4873.366462359871, 5008.524190201925, 5082.288479612857, 5098.949010509921, 5101.668391554537, 4713.6464765142755, 4714.15145273854, 4759.904801903943, 4790.0419916016235, 4804.351412559329, 4950.257461380822, 4953.950460495421, 4992.226204938241, 5003.324551185543, 5012.248162775612, 4764.237721964469, 4827.468978412442, 4881.731504767201, 4914.950850491521, 4917.459079501252, 4741.5021422750115, 4769.260764581495, 4816.903661926742, 4818.445878723922, 4827.831025914076, 3816.713746469026, 3826.311263972456, 3842.2507611016144, 3881.7670939743707, 3889.0083028827466, 3398.9830050849587, 3399.1502124468884, 3442.345954268681, 3478.7738796978115, 3541.3448512025357, 4674.74288914113, 4710.6702530823195, 4725.598324142417, 4759.23852183649, 4825.565699087028, 4950.43070046942, 4976.676516026447, 4986.052649996489, 5045.571126454219, 5103.591712662978, 4536.206163921366, 4582.816687332469, 4634.745089020069, 4685.5782979532005, 4711.976440117846, 4299.462567179103, 4312.654987600984, 4322.0491491871735, 4370.781460927004, 4375.693701440932, 5027.723475208899, 5040.873978150576, 5116.8209112681625, 5121.820736274212, 5125.384953805567, 4876.951230487792, 4917.164082106122, 4927.704337739747, 4942.703437793743, 4996.3005179274205, 5052.797888084436, 5117.360329958755, 5128.205128205134, 5164.457731938092, 5164.870878228075, 4782.832600859092, 4888.364512613338, 4895.115306168007, 4958.25626156065, 4963.181075122564, 4868.829590964299, 4882.560569548616, 4920.015996800583, 4932.0, 4963.156263435152, 4811.374521312207, 4827.758612069452, 4872.14737420957, 4884.9985752921275, 4891.0, 4631.2126938421225, 4837.709737415626, 4842.564169224786, 4858.198397264412, 4876.78054487556, 4411.602955733999, 4461.4869290030765, 4550.0, 4589.518100599389, 4596.103759766947, 4733.621310295237, 4842.58837998774, 4907.5828554571835, 4909.582685471775, 4922.4585295616735, 4563.201439747964, 4596.701214421186, 4764.190087685032, 4794.376731024944, 4825.5174482551465], "mootools.html": [1452.1432354910603, 1480.4966311454104, 1513.0089791186776, 1541.1446647110856, 1554.9611259718508, 6190.0, 6260.373962603738, 6957.234704182542, 7102.644867756618, 7130.2513236110235, 6618.238902526211, 6634.70143843527, 6842.418394436467, 6854.177498700163, 6875.759348422806, 1910.0736142970613, 1919.7408349872799, 1922.1542521290587, 1947.6591596470632, 1954.3257576136211, 1918.290232613935, 1961.6076784643058, 1973.2008536542724, 1975.3283883479614, 1995.0, 1894.2233684189484, 1924.01875043728, 1938.3506525314037, 1940.5730739237415, 1945.3580318494933, 1863.3292014874635, 1903.8381737552324, 1914.3108480946848, 1922.5578117033021, 1932.7294178814977, 1934.9709754353696, 1940.7185958036005, 1942.417274817549, 1954.4136758972393, 1980.5048737815546, 6831.28271531487, 6914.757983470605, 6946.895796563055, 6977.93022069783, 7002.194747603989, 4103.384492326145, 4202.474690663667, 4248.171606536726, 4250.553691862372, 4275.657947364234, 2461.3354394313615, 2472.6043832986816, 2534.4804315115543, 2549.1078122656922, 2568.2166939083572, 765.3494529649809, 767.5049593012532, 772.5248971882252, 786.5123623353501, 797.2266901105918, 9248.722538323862, 9267.721968341028, 9311.44131352121, 9336.3464557481, 9369.390989585656, 3794.5067141271456, 3797.468354430382, 3802.2585595809105, 3847.2690188864026, 3858.8070596470066, 8081.0706768721175, 8112.107668156498, 8138.593070346459, 8174.141715119946, 8217.753467395987, 4140.15126898985, 4148.771817550064, 4160.604742549453, 4161.500619925568, 4190.53904070552, 3353.748468864845, 3490.458978858281, 3741.663250307431, 3778.5843557208686, 3797.1076796952693, 3144.811311321328, 3261.0, 3278.5901762279714, 3331.400347937346, 3339.7996120232865, 1066.1790421375651, 1078.8597482327248, 1082.821334479802, 1095.6055819904827, 1107.900288973996, 902.8149229407956, 911.4030310146865, 912.589334799343, 954.8281309364243, 1140.931544107356, 6484.967575162094, 6495.577787443801, 6591.835204119935, 6604.075429439882, 6636.568623039487, 987.1559816357055, 1006.4363956184413, 1022.6778564752079, 1024.9180065594883, 1041.6927006533092, 5006.224035274538, 5058.671186372874, 5081.59347252219, 5101.770420331094, 5184.533391994739, 8044.678212871419, 8285.461445006054, 8312.25189732927, 8316.251537361546, 8322.334213262924, 8023.117457079717, 8121.878171827428, 8143.796405089802, 8228.21831925966, 8294.626741796634, 6578.0, 6590.242122155918, 6634.502412319095, 6636.701348439332, 6681.632510211888, 6457.773977910751, 6510.44661203784, 6617.272100069084, 6641.0, 6649.301823308677, 7161.069061022034, 7363.852722945619, 7397.741079062207, 7502.587357695379, 7506.8498630026, 7627.351675107456, 7641.579713115832, 7686.7309644164425, 7734.7679569613, 7762.88355674654, 5466.180072989084, 5643.774249030157, 5721.828345149652, 5773.422657734193, 5857.4435428634215, 6399.392057754506, 6569.605823650596, 6583.703733331916, 6652.600843949185, 6663.800085997428, 6171.691415429301, 6247.937520624736, 6262.718177682106, 6314.842128946813, 6358.141650877257, 6031.5476339273855, 6102.237220347457, 6186.597871138361, 6193.0, 6288.779892703734, 6222.533310001859, 6293.276273228455, 6339.683015849281, 6347.650879201688, 6371.936280637135, 5697.54419646419, 5731.312242530923, 5735.569832262514, 5739.770409183586, 5760.884782304247, 5786.1899334094105, 5804.970975145097, 5826.679532625746, 5856.12158176277, 5904.261967254093], "ext.html": [466.9346291519188, 481.7663433234881, 487.0308086907054, 502.861713028917, 515.1242887091945, 33758.83120584397, 34783.0, 34859.65140348596, 35028.12429689253, 35343.4698479523, 37686.0, 38178.42732359017, 38204.61795382045, 38239.80880095602, 38409.8079509602, 7973.40199485038, 8014.719484818003, 8154.3884208684285, 8186.672533098698, 8225.95887020564, 7956.761297161094, 7976.202379762007, 7977.641006154737, 8024.317932975704, 8054.838903221932, 8012.719554815582, 8100.149484304122, 8109.270165685087, 8114.0, 8147.674093036271, 8149.062857771343, 8194.836103277901, 8196.508209507449, 8218.301444377204, 8261.83476330476, 7856.332211762007, 7930.524168549906, 7948.284654381134, 7982.281594656451, 7984.560849153294, 34834.30331393383, 35385.64614353849, 35467.82266088679, 35643.4653480198, 35754.821225893706, 2157.169489746443, 2328.8020518255967, 2335.866080968788, 2496.7378425265447, 2712.986435067812, 23955.520889582283, 24858.5028299433, 25159.0, 25538.744612553823, 26235.344116397242, 2062.855600107993, 2078.844086693504, 2079.5009197792574, 2130.723006009209, 2138.925137620176, 223264.0, 228380.0, 229124.0, 229227.0, 231836.0, 35545.64454355475, 36185.81907090448, 36306.0, 36339.27321453556, 53917.069122396504, 35598.46602300968, 35646.0, 35831.0, 35889.64110358863, 36143.096422589646, 12852.614421567368, 12870.034747393984, 12880.613581592566, 13011.089223754436, 13100.934495327463, 10208.795824083476, 10217.948910255549, 10222.693319200436, 10250.897491024994, 10293.279470436997, 12401.13192076546, 12413.379331033413, 12434.316112613893, 12437.93781031089, 12482.875171248354, 5392.325959255093, 5492.231087647732, 5525.751341189576, 5554.888902221933, 5590.496855283044, 775.6897241103603, 785.6935795039939, 852.1733918099434, 889.74642226965, 991.2417000994245, 24437.633435498483, 24718.25845224646, 26783.330416739736, 28248.576271355945, 28551.857240713663, 882.9514376709215, 907.4963395315531, 912.4160537256162, 974.3033730882312, 1064.632701717906, 12760.234385936874, 12774.68063298425, 12876.291803950873, 14066.85933140676, 14688.192149431883, 356980.0, 358101.0, 359581.0, 360077.0, 361637.0, 50940.74529627402, 51549.226761598606, 51693.0, 51718.22422663663, 51802.48197517976, 1164.737933964868, 1167.6088510349127, 1184.763047390508, 1199.7060720123452, 1209.214010892909, 25954.22137335883, 26163.607545886447, 26207.082752103586, 26450.470990580467, 26544.203673889813, 43673.56326436695, 45005.54994450013, 45175.548244518446, 45443.54556454393, 45444.772776135906, 251465.0, 251857.0, 251964.0, 252995.0, 253774.0, 36846.815765921, 37205.25589488141, 38260.51306665058, 40244.79877600593, 40306.596934031455, 37323.0, 37349.81325093357, 37538.436923446716, 37910.62089379181, 38211.61788382081, 30935.381292373575, 32134.196645083124, 32200.838995804872, 32239.677603224605, 32334.514982274814, 33822.926561016044, 34340.0, 34988.30023399569, 35100.297994040484, 35189.64810351864, 31470.055898323088, 31735.523967140973, 32118.518222227154, 32143.517847231844, 32195.356092877544, 27196.32009199786, 27204.0, 28332.291692707848, 28350.716492835632, 28410.289742756595, 21272.574548508634, 21317.893410532848, 21428.571428571653, 21538.246161384275, 21581.46046348791], "prototype.html": [271.5641395560126, 272.76950976424916, 279.6630060776763, 279.986000699965, 280.4630624179495, 5311.760970756325, 5336.946630533694, 5484.396716361197, 5535.003699334118, 5547.167924811275, 5487.725613719318, 5490.80782172624, 5493.395726470095, 5537.778488860441, 5563.082091454905, 4166.729162604436, 4202.222588821078, 4221.577842215785, 4236.703430759848, 4236.851710190144, 4215.810288537024, 4216.430781844458, 4224.302990006645, 4224.38746381776, 4229.450171477703, 3931.783751893645, 4079.8980025499304, 4162.521310049353, 4169.895752606179, 4190.748555086705, 4046.413270075852, 4059.675225981929, 4067.044244602516, 4083.428320035168, 4112.876613701564, 3459.1697992481622, 3476.582810062783, 3479.373712731707, 3491.30173965208, 3503.2117773501013, 5155.922661160085, 5384.876771472536, 5402.459754024605, 5403.972980135113, 5414.377346605152, 4617.12274667812, 4626.514216007338, 4628.745419001953, 4636.814527418899, 4664.300354946751, 5754.539636829044, 5775.537956963432, 5779.133130030487, 5786.305643322786, 5787.135367992829, 3800.8859734208017, 3806.8667596633986, 3808.5429748430365, 3820.732548721591, 3831.348670725983, 5835.737391817378, 5985.191999080112, 6021.759129634853, 6023.849403764897, 6024.638521688669, 3816.484774555455, 3870.4968354113785, 3877.1470276539117, 3883.2815929053218, 3886.5530463997, 3921.137349783043, 3926.3521518949624, 3952.6442620164325, 3966.36538153894, 3971.801409929492, 4559.863204103882, 4622.352870598119, 4627.444706635225, 4630.305454181832, 4632.305154226893, 5362.946370536322, 5502.422245664147, 5579.553635709133, 5658.74535645897, 5662.8301150965535, 1352.7970804379224, 1371.2047012732592, 1374.9037567370387, 1383.5365152673967, 1387.9444822207, 864.7535452396163, 866.9219770220584, 881.2817553693719, 888.8444522208717, 892.3173772064376, 5565.805196818173, 5583.944160558423, 5596.2165296858475, 5602.207293665988, 5613.775448981995, 5997.7001149942325, 6013.729382177812, 6019.909701354483, 6030.969845150834, 6031.9396806032255, 5567.66594004361, 5569.610127291132, 5574.888502229933, 5578.163275508706, 5636.746346414339, 3159.2733671255282, 3230.2570408806105, 3248.3990461764647, 3253.9511907321407, 3264.1275677403733, 6156.507479401637, 6187.288461826857, 6199.3490683478485, 6200.131981522591, 6203.193584834033, 6115.785947491817, 6140.140380346755, 6146.631202127886, 6160.969195153995, 6172.69136543171, 6017.518598512021, 6151.6001459904965, 6195.318514963441, 6210.7515699372425, 6320.936790632035, 6030.216071910799, 6085.087236914498, 6100.938990610037, 6119.632822030692, 6138.294096178996, 5914.467697907209, 5930.080837470199, 5940.940590594038, 5946.197263369563, 5949.137375080502, 6042.667653279112, 6222.253329600477, 6224.657643829632, 6227.346128656607, 6260.40526150015, 3858.2090671411734, 3893.610638936084, 3899.53205615328, 3919.47087143232, 3925.488686855524, 5694.487496125369, 5874.118882167709, 5975.701214939322, 6003.279606447254, 6070.939290607037, 5690.658560486384, 5835.8541036472725, 5837.6497410155525, 5846.093855452412, 5850.0932355484965, 5866.413358664099, 5869.4717475427415, 5871.882562348644, 5872.588918775816, 5884.47039766423, 5611.018071837494, 5694.1458781183155, 5720.911867168536, 5752.9712351437975, 5767.307923049261, 5841.766329346949, 5843.94156058451, 5873.471387575139, 5878.823635290948, 5954.553408494294, 5713.085906254979, 5746.597738158456, 5751.194832723339, 5769.307683078057, 5771.076627739541], "yui.html": [537.4007981101068, 586.3842964886869, 590.9822705318842, 621.456225802423, 627.0750642801868, 9652.951735241322, 9916.603335866575, 10124.29129960903, 10131.138853197477, 10159.542820573073, 9261.26792596184, 9391.389559678617, 9468.100530449614, 9473.431594104359, 9542.0935011174, 750.8723517002109, 764.6864785437972, 765.5827573972199, 772.3126417488439, 772.8802035684478, 752.0449029732237, 766.9003029606172, 775.592813772771, 776.6000509737489, 779.9899130625853, 791.7149826062613, 799.9960000199991, 801.1227705662291, 802.8233788566536, 804.3283857978565, 775.2634996753079, 789.7157023471545, 800.7277525641281, 803.6062329458582, 804.3926835239386, 593.8366949088992, 596.588354035714, 600.7777122464672, 600.8047384600022, 602.8643555200089, 8616.396852220347, 8739.912600873973, 8784.60469278884, 8807.383483156182, 8846.601902914384, 8427.957860210721, 8483.830323393497, 8509.234168924826, 8923.955380223122, 9083.500407477586, 7501.962490187569, 7860.056793184797, 7874.173211812735, 7946.801329966739, 8125.0, 2763.6125991424883, 2808.185626168409, 2811.4939310924024, 2848.9287767805763, 2887.06170494588, 36472.0, 37495.62504374949, 37556.43665344995, 41295.38056929148, 41524.792376038225, 5670.206171136044, 5709.857253568611, 5809.535237181015, 5890.734916928748, 6110.541709371815, 10529.947350263199, 10541.0, 10548.0, 10555.47222638865, 10591.205659575562, 5185.481451854785, 5294.735263236823, 5300.867478313073, 5429.809956651498, 5436.320459942507, 3080.7073328033803, 3084.568160457538, 3172.2069482629345, 3225.5645487858837, 3231.5152727090654, 2231.129859354853, 2262.7284725833006, 2267.6711876778104, 2269.4553307206484, 2396.484755777516, 367.4561648759797, 370.69788122679927, 371.3371631637514, 375.0904057660163, 378.5419642232874, 427.6749670250632, 481.36459872968044, 487.256933176901, 516.8501134670978, 530.8858595402007, 6566.474682025522, 6980.232174460805, 7028.4025857801635, 7098.6450677466955, 7123.430125590044, 384.95188101487315, 392.25667360351974, 434.7545572302775, 478.9128677901145, 481.2132163912029, 3143.292759129223, 3171.8255495947483, 3222.646488474846, 3225.7580681448985, 3251.934961300808, 47480.762596186796, 48626.756866215444, 48771.512284877404, 49111.75444122757, 52386.21420678693, 43529.0, 43705.0, 44705.0, 45264.77367613141, 45316.320255196195, 35224.29551409009, 35237.82381088078, 38861.6113838858, 40538.18923621511, 41450.79274603668, 6837.62393068386, 6913.51605387618, 7017.859642807013, 7027.754028608974, 7467.439942004263, 30706.232344191572, 30942.845285773426, 31137.844310778302, 31722.524162137124, 31872.521912170872, 39662.2067558653, 40307.59692403038, 41073.58926410697, 41479.7926010368, 41519.58480415157, 6368.108464814837, 6464.644444555594, 6632.2372927114, 6884.242733299433, 6904.3095690430555, 9357.438553686801, 9397.977941176547, 9587.856182157133, 9642.71071867845, 9688.32181747271, 9069.501177435304, 9162.67930622425, 9201.171894529525, 9201.263898888206, 9225.308101892519, 9060.728178154666, 9086.591103400495, 9107.590158442754, 9121.179093881583, 9130.0, 8856.291496680378, 8975.730728078168, 8984.730458086267, 8991.640334386551, 8996.730098097067, 7800.375969922279, 7977.6011199438635, 8314.62584183701, 8344.123866994121, 8366.99536652007, 7074.752383666547, 7295.817604559928, 7442.1069471661585, 7619.771406857803, 7641.503302285334]}, "summary": {"lowerIsBetter": false, "suite": 5683.375693204504, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 5620.755847231516, "unit": "ms", "value": 5620.755847231516}, "dojo.html": {"lowerIsBetter": false, "filtered": 4532.250208951199, "unit": "ms", "value": 4532.250208951199}, "mootools.html": {"lowerIsBetter": false, "filtered": 3941.583404086781, "unit": "ms", "value": 3941.583404086781}, "ext.html": {"lowerIsBetter": false, "filtered": 15888.194870562396, "unit": "ms", "value": 15888.194870562396}, "prototype.html": {"lowerIsBetter": false, "filtered": 4302.177195336798, "unit": "ms", "value": 4302.177195336798}, "yui.html": {"lowerIsBetter": false, "filtered": 4909.694998630257, "unit": "ms", "value": 4909.694998630257}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0089.e"}, "testrun": {"date": 1447731607, "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": "20151116173404", "branch": "Fx-Team", "revision": "ffdc7f22130425020f5d648ef99c10b947541659"}}, {"talos_counters": {}, "results": {"audio-dft": [190.0, 202.0, 213.0, 205.0, 202.0, 199.0, 194.0, 195.0, 205.0, 198.0], "ai-astar": [127.0, 124.0, 135.0, 133.0, 133.0, 139.0, 129.0, 134.0, 135.0, 134.0], "imaging-gaussian-blur": [151.0, 142.0, 140.0, 142.0, 143.0, 149.0, 149.0, 148.0, 143.0, 136.0], "audio-beat-detection": [183.0, 164.0, 182.0, 196.0, 158.0, 180.0, 181.0, 159.0, 195.0, 159.0], "json-stringify-tinderbox": [78.0, 83.0, 86.0, 83.0, 88.0, 88.0, 86.0, 87.0, 83.0, 83.0], "stanford-crypto-pbkdf2": [182.0, 196.0, 196.0, 191.0, 186.0, 185.0, 190.0, 194.0, 183.0, 175.0], "json-parse-financial": [68.0, 72.0, 75.0, 74.0, 75.0, 77.0, 77.0, 84.0, 76.0, 75.0], "stanford-crypto-sha256-iterative": [80.0, 84.0, 87.0, 89.0, 88.0, 88.0, 94.0, 87.0, 90.0, 87.0], "audio-fft": [81.0, 91.0, 100.0, 153.0, 82.0, 85.0, 86.0, 87.0, 124.0, 81.0], "imaging-darkroom": [156.0, 156.0, 150.0, 157.0, 156.0, 149.0, 156.0, 157.0, 158.0, 151.0], "stanford-crypto-ccm": [167.0, 155.0, 168.0, 162.0, 161.0, 151.0, 151.0, 161.0, 158.0, 167.0], "audio-oscillator": [100.0, 104.0, 157.0, 106.0, 110.0, 110.0, 153.0, 107.0, 104.0, 152.0], "stanford-crypto-aes": [103.0, 107.0, 109.0, 107.0, 107.0, 107.0, 109.0, 106.0, 103.0, 102.0], "imaging-desaturate": [116.0, 130.0, 117.0, 128.0, 121.0, 126.0, 118.0, 122.0, 118.0, 127.0]}, "summary": {"lowerIsBetter": true, "suite": 1847.8999999999996, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 97.0, "unit": "ms", "value": 97.0}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 187.8, "unit": "ms", "value": 187.8}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 175.7, "unit": "ms", "value": 175.7}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 160.1, "unit": "ms", "value": 160.1}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 154.6, "unit": "ms", "value": 154.6}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 75.3, "unit": "ms", "value": 75.3}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 120.3, "unit": "ms", "value": 120.3}, "ai-astar": {"lowerIsBetter": true, "filtered": 132.3, "unit": "ms", "value": 132.3}, "audio-dft": {"lowerIsBetter": true, "filtered": 200.3, "unit": "ms", "value": 200.3}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 87.4, "unit": "ms", "value": 87.4}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 84.5, "unit": "ms", "value": 84.5}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 144.3, "unit": "ms", "value": 144.3}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 106.0, "unit": "ms", "value": 106.0}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 122.3, "unit": "ms", "value": 122.3}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0089.e"}, "testrun": {"date": 1447731607, "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": "20151116173404", "branch": "Fx-Team", "revision": "ffdc7f22130425020f5d648ef99c10b947541659"}}, {"talos_counters": {}, "results": {"DeltaBlue": [229.6211251435132], "Encrypt": [367.5119441381845], "NavierStokes": [6673.333333333333], "Decrypt": [6532.467532467533], "Splay": [788.6557886557887], "Richards": [839.6305625524769], "RegExp": [33733.333333333336], "Earley": [1020.4081632653061], "Boyer": [16225.806451612903], "RayTrace": [1302.0833333333333]}, "summary": {"lowerIsBetter": false, "suite": 14306.510187626434, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 287.94389000000007, "unit": "score", "value": 287.94389000000007}, "Encrypt": {"lowerIsBetter": false, "filtered": 724.2785010000003, "unit": "score", "value": 724.2785010000003}, "NavierStokes": {"lowerIsBetter": false, "filtered": 222.37762237762246, "unit": "score", "value": 222.37762237762246}, "Decrypt": {"lowerIsBetter": false, "filtered": 40.747389662027814, "unit": "score", "value": 40.747389662027814}, "Splay": {"lowerIsBetter": false, "filtered": 103.32898226600987, "unit": "score", "value": 103.32898226600987}, "RegExp": {"lowerIsBetter": false, "filtered": 27.005484189723308, "unit": "score", "value": 27.005484189723308}, "Richards": {"lowerIsBetter": false, "filtered": 42.044682, "unit": "score", "value": 42.044682}, "Earley": {"lowerIsBetter": false, "filtered": 653.1337399999998, "unit": "score", "value": 653.1337399999998}, "Boyer": {"lowerIsBetter": false, "filtered": 41.074260437375735, "unit": "score", "value": 41.074260437375735}, "RayTrace": {"lowerIsBetter": false, "filtered": 568.3115519999999, "unit": "score", "value": 568.3115519999999}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0089.e"}, "testrun": {"date": 1447731607, "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": "20151116173404", "branch": "Fx-Team", "revision": "ffdc7f22130425020f5d648ef99c10b947541659"}}] 20:00:21 INFO - RETURN: dromaeo_css: 5683.37 20:00:21 INFO - RETURN: kraken: 1847.90 20:00:21 INFO - RETURN: v8_7: 14306.51 20:00:21 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,57]]", "result": "14306.51"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,57]]", "result": "1847.90"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,57]]", "result": "5683.37"}}} 20:00:21 INFO - Return code: 0 20:00:21 INFO - # TBPL SUCCESS # 20:00:21 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 20:00:21 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 20:00:21 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 20:00:21 INFO - 2015-11-16 20:00:21.476 screenresolution[2354:77769] starting screenresolution argv=screenresolution get 20:00:21 INFO - 2015-11-16 20:00:21.480 screenresolution[2354:77769] Display 0: 1600x1200x32@60 20:00:21 INFO - 2015-11-16 20:00:21.486 screenresolution[2355:77772] starting screenresolution argv=screenresolution list 20:00:21 INFO - Available Modes on Display 0 20:00:21 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 20:00:21 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 20:00:21 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 20:00:21 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 20:00:21 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 20:00:21 INFO - Intel HD Graphics 3000: 20:00:21 INFO - Chipset Model: Intel HD Graphics 3000 20:00:21 INFO - Type: GPU 20:00:21 INFO - Bus: Built-In 20:00:21 INFO - VRAM (Total): 512 MB 20:00:21 INFO - VRAM (Dynamic, Max): 10 20:00:21 INFO - Vendor: Intel (0x8086) 20:00:21 INFO - Device ID: 0x0116 20:00:21 INFO - Revision ID: 0x0009 20:00:21 INFO - Displays: 20:00:21 INFO - Display: 20:00:21 INFO - Resolution: 1600 x 1200 @ 60 Hz 20:00:21 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 20:00:21 INFO - Display Serial Number: 1600x1200 60 20:00:21 INFO - Main Display: Yes 20:00:21 INFO - Mirror: Off 20:00:21 INFO - Online: Yes 20:00:21 INFO - Rotation: Supported 20:00:21 INFO - Return code: 0 20:00:21 INFO - Running post-action listener: _resource_record_post_action 20:00:21 INFO - Running post-run listener: _resource_record_post_run 20:00:22 INFO - Total resource usage - Wall time: 1256s; CPU: 30.0%; Read bytes: 135168; Write bytes: 692088832; Read time: 348; Write time: 61801 20:00:22 INFO - install - Wall time: 41s; CPU: 30.0%; Read bytes: 342295040; Write bytes: 336226304; Read time: 36415; Write time: 4741 20:00:22 INFO - run-tests - Wall time: 1215s; CPU: 30.0%; Read bytes: 135168; Write bytes: 345483264; Read time: 348; Write time: 55782 20:00:22 INFO - Running post-run listener: _upload_blobber_files 20:00:22 INFO - Blob upload gear active. 20:00:22 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 20:00:22 INFO - Copying logs to upload dir... 20:00:22 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1310.178929 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 50 secs) (at 2015-11-16 20:00:22.945105) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-16 20:00:22.949038) ========= 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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners TMPDIR=/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/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/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011008 build_url: 'https://queue.taskcluster.net/v1/task/T69NBGm4QeG0GKvCRgT60g/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-16 20:00:22.976417) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 20:00:22.976750) ========= 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.r5WUpzmyLD/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.SxCb2VhwUx/Listeners TMPDIR=/var/folders/t_/bv_ctpx94r99tfm1h_wdzg9000000w/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.005703 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 20:00:23.027025) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-16 20:00:23.027404) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-16 20:00:23.027857) ========= ========= Total master_lag: 0.22 =========