builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0202 starttime: 1475053861.86 results: success (0) buildid: 20160928011020 builduid: 756e4079600d4aeeb0b825cc990b2baa revision: 45513d6773f099db66f0cd7bf1e312f6f9d11475 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:01.864677) ========= master: http://buildbot-master133.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:01.865127) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:01.865434) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:02.019631) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:02.019918) ========= 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.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners TMPDIR=/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/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:0:0 using PTY: False --2016-09-28 02:11:02-- 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% 18.7M=0.001s 2016-09-28 02:11:02 (18.7 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.834249 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:02.878536) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:02.878859) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners TMPDIR=/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/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:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.029919 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:02.933940) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-28 02:11:02.934332) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 45513d6773f099db66f0cd7bf1e312f6f9d11475 --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 45513d6773f099db66f0cd7bf1e312f6f9d11475 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners TMPDIR=/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/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:0:0 using PTY: False 2016-09-28 02:11:03,023 truncating revision to first 12 chars 2016-09-28 02:11:03,023 Setting DEBUG logging. 2016-09-28 02:11:03,023 attempt 1/10 2016-09-28 02:11:03,023 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/45513d6773f0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-28 02:11:04,299 unpacking tar archive at: fx-team-45513d6773f0/testing/mozharness/ program finished with exit code 0 elapsedTime=1.551024 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-28 02:11:04.512943) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:04.513258) ========= script_repo_revision: 45513d6773f099db66f0cd7bf1e312f6f9d11475 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:04.513702) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:04.513990) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-28 02:11:04.531654) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 13 secs) (at 2016-09-28 02:11:04.532032) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --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', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--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.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners TMPDIR=/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/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:0:0 using PTY: False 02:11:04 INFO - MultiFileLogger online at 20160928 02:11:04 in /builds/slave/test 02:11:04 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 02:11:04 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:11:04 INFO - {'append_to_log': False, 02:11:04 INFO - 'base_work_dir': '/builds/slave/test', 02:11:04 INFO - 'blob_upload_branch': 'Fx-Team', 02:11:04 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:11:04 INFO - 'branch': 'Fx-Team', 02:11:04 INFO - 'buildbot_json_path': 'buildprops.json', 02:11:04 INFO - 'config_files': ('talos/mac_config.py',), 02:11:04 INFO - 'default_actions': ('clobber', 02:11:04 INFO - 'read-buildbot-config', 02:11:04 INFO - 'download-and-extract', 02:11:04 INFO - 'populate-webroot', 02:11:04 INFO - 'create-virtualenv', 02:11:04 INFO - 'install', 02:11:04 INFO - 'run-tests'), 02:11:04 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:11:04 INFO - 'download_minidump_stackwalk': True, 02:11:04 INFO - 'download_symbols': 'ondemand', 02:11:04 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 02:11:04 INFO - 'tooltool.py': '/tools/tooltool.py', 02:11:04 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 02:11:04 INFO - '/tools/misc-python/virtualenv.py')}, 02:11:04 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:11:04 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:11:04 INFO - 'installer_path': 'installer.exe', 02:11:04 INFO - 'log_level': 'info', 02:11:04 INFO - 'log_name': 'talos', 02:11:04 INFO - 'log_to_console': True, 02:11:04 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 02:11:04 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 02:11:04 INFO - 'opt_config_files': (), 02:11:04 INFO - 'pip_index': False, 02:11:04 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 02:11:04 INFO - 'cmd': ('bash', 02:11:04 INFO - '-c', 02:11:04 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 02:11:04 INFO - 'enabled': True, 02:11:04 INFO - 'halt_on_failure': False, 02:11:04 INFO - 'name': 'check_screen_resolution'},), 02:11:04 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 02:11:04 INFO - 'cmd': ('bash', 02:11:04 INFO - '-c', 02:11:04 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 02:11:04 INFO - 'enabled': True, 02:11:04 INFO - 'halt_on_failure': False, 02:11:04 INFO - 'name': 'check_screen_resolution'},), 02:11:04 INFO - 'run_cmd_checks_enabled': True, 02:11:04 INFO - 'sps_profile': False, 02:11:04 INFO - 'sps_profile_interval': 0, 02:11:04 INFO - 'suite': 'dromaeojs', 02:11:04 INFO - 'system_bits': '32', 02:11:04 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:11:04 INFO - 'title': 't-yosemite-r7-0202', 02:11:04 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:11:04 INFO - 'use_talos_json': True, 02:11:04 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:11:04 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:11:04 INFO - 'work_dir': 'build'} 02:11:04 INFO - [mozharness: 2016-09-28 09:11:04.736431Z] Running clobber step. 02:11:04 INFO - Running pre-action listener: _resource_record_pre_action 02:11:04 INFO - Running main action method: clobber 02:11:04 INFO - rmtree: /builds/slave/test/build 02:11:04 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:11:07 INFO - Running post-action listener: _resource_record_post_action 02:11:07 INFO - [mozharness: 2016-09-28 09:11:07.155188Z] Finished clobber step (success) 02:11:07 INFO - [mozharness: 2016-09-28 09:11:07.155314Z] Running read-buildbot-config step. 02:11:07 INFO - Running pre-action listener: _resource_record_pre_action 02:11:07 INFO - Running main action method: read_buildbot_config 02:11:07 INFO - Using buildbot properties: 02:11:07 INFO - { 02:11:07 INFO - "project": "", 02:11:07 INFO - "product": "firefox", 02:11:07 INFO - "script_repo_revision": "production", 02:11:07 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 02:11:07 INFO - "repository": "", 02:11:07 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 02:11:07 INFO - "buildid": "20160928011020", 02:11:07 INFO - "pgo_build": "False", 02:11:07 INFO - "basedir": "/builds/slave/test", 02:11:07 INFO - "buildnumber": 175, 02:11:07 INFO - "slavename": "t-yosemite-r7-0202", 02:11:07 INFO - "master": "http://buildbot-master133.bb.releng.scl3.mozilla.com:8201/", 02:11:07 INFO - "platform": "yosemite_r7", 02:11:07 INFO - "scheduler": "tests-fx-team-macosx64-talos", 02:11:07 INFO - "branch": "fx-team", 02:11:07 INFO - "repo_path": "integration/fx-team", 02:11:07 INFO - "revision": "45513d6773f099db66f0cd7bf1e312f6f9d11475", 02:11:07 INFO - "stage_platform": "macosx64", 02:11:07 INFO - "builduid": "756e4079600d4aeeb0b825cc990b2baa", 02:11:07 INFO - "slavebuilddir": "test" 02:11:07 INFO - } 02:11:07 INFO - Found installer url https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg. 02:11:07 INFO - Running post-action listener: _resource_record_post_action 02:11:07 INFO - [mozharness: 2016-09-28 09:11:07.158494Z] Finished read-buildbot-config step (success) 02:11:07 INFO - [mozharness: 2016-09-28 09:11:07.158613Z] Running download-and-extract step. 02:11:07 INFO - Running pre-action listener: _resource_record_pre_action 02:11:07 INFO - Running main action method: download_and_extract 02:11:07 INFO - mkdir: /builds/slave/test/build/tests 02:11: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:07 INFO - trying https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json 02:11:07 INFO - Downloading https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 02:11:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json'}, attempt #1 02:11:08 INFO - Downloaded 1199 bytes. 02:11:08 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 02:11:08 INFO - Using the following test package requirements: 02:11:08 INFO - {u'common': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 02:11:08 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 02:11:08 INFO - u'firefox-52.0a1.en-US.mac.cppunittest.tests.zip'], 02:11:08 INFO - u'gtest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 02:11:08 INFO - u'firefox-52.0a1.en-US.mac.gtest.tests.zip'], 02:11:08 INFO - u'jittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 02:11:08 INFO - u'jsshell-mac.zip'], 02:11:08 INFO - u'mochitest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 02:11:08 INFO - u'firefox-52.0a1.en-US.mac.mochitest.tests.zip'], 02:11:08 INFO - u'mozbase': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 02:11:08 INFO - u'reftest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 02:11:08 INFO - u'firefox-52.0a1.en-US.mac.reftest.tests.zip'], 02:11:08 INFO - u'talos': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 02:11:08 INFO - u'firefox-52.0a1.en-US.mac.talos.tests.zip'], 02:11:08 INFO - u'web-platform': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 02:11:08 INFO - u'firefox-52.0a1.en-US.mac.web-platform.tests.zip'], 02:11:08 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 02:11:08 INFO - u'firefox-52.0a1.en-US.mac.xpcshell.tests.zip']} 02:11:08 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip'] for test suite category: common 02:11:08 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 02:11:08 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 02:11:08 INFO - Fetch https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 02:11:08 INFO - Expected file size: 16470424 02:11:15 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip', u'firefox-52.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 02:11:15 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 02:11:15 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 02:11:15 INFO - Fetch https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 02:11:16 INFO - Expected file size: 16470424 02:11:22 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip 02:11:22 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip'}, attempt #1 02:11:22 INFO - Fetch https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip into memory 02:11:23 INFO - Expected file size: 14414062 02:11:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:24 INFO - trying https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 02:11:24 INFO - Downloading https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg 02:11:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg'}, attempt #1 02:11:27 INFO - Downloaded 111545968 bytes. 02:11:27 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 02:11:27 INFO - mkdir: /builds/slave/test/properties 02:11:27 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:11:27 INFO - Writing to file /builds/slave/test/properties/build_url 02:11:27 INFO - Contents: 02:11:27 INFO - build_url:https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 02:11:27 INFO - Running post-action listener: _resource_record_post_action 02:11:27 INFO - Running post-action listener: set_extra_try_arguments 02:11:27 INFO - [mozharness: 2016-09-28 09:11:27.769687Z] Finished download-and-extract step (success) 02:11:27 INFO - [mozharness: 2016-09-28 09:11:27.769860Z] Running populate-webroot step. 02:11:27 INFO - Running pre-action listener: _resource_record_pre_action 02:11:27 INFO - Running main action method: populate_webroot 02:11:27 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 02:11:27 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 02:11:27 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 02:11:27 INFO - '--tppagecycles', 02:11:27 INFO - '7'], 02:11:27 INFO - 'tests': ['tsvgm']}}, 02:11:27 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['tresize', 'tcanvasmark']}, 02:11:27 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 02:11:27 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['dromaeo_css', 'kraken']}, 02:11:27 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 02:11:27 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:11:27 INFO - 'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:11:27 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:11:27 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:11:27 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:11:27 INFO - 'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['damp', 'tps']}, 02:11:27 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:11:27 INFO - 'tests': ['damp', 'tps']}, 02:11:27 INFO - 'g3': {'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['dromaeo_dom']}, 02:11:27 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:11:27 INFO - 'g4': {'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['basic_compositor_video']}, 02:11:27 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 02:11:27 INFO - 'other': {'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['a11yr', 02:11:27 INFO - 'ts_paint', 02:11:27 INFO - 'tpaint', 02:11:27 INFO - 'sessionrestore', 02:11:27 INFO - 'sessionrestore_no_auto_restore', 02:11:27 INFO - 'tabpaint']}, 02:11:27 INFO - 'other-e10s': {'tests': ['a11yr', 02:11:27 INFO - 'ts_paint', 02:11:27 INFO - 'tpaint', 02:11:27 INFO - 'sessionrestore', 02:11:27 INFO - 'sessionrestore_no_auto_restore', 02:11:27 INFO - 'tabpaint']}, 02:11:27 INFO - 'other-e10s_l64': {'tests': ['a11yr', 02:11:27 INFO - 'ts_paint', 02:11:27 INFO - 'tpaint', 02:11:27 INFO - 'sessionrestore', 02:11:27 INFO - 'sessionrestore_no_auto_restore', 02:11:27 INFO - 'tabpaint']}, 02:11:27 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 02:11:27 INFO - 'ts_paint', 02:11:27 INFO - 'tpaint', 02:11:27 INFO - 'sessionrestore', 02:11:27 INFO - 'sessionrestore_no_auto_restore', 02:11:27 INFO - 'tabpaint']}, 02:11:27 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['a11yr', 02:11:27 INFO - 'ts_paint', 02:11:27 INFO - 'tpaint', 02:11:27 INFO - 'sessionrestore', 02:11:27 INFO - 'sessionrestore_no_auto_restore', 02:11:27 INFO - 'tabpaint']}, 02:11:27 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['a11yr', 02:11:27 INFO - 'ts_paint', 02:11:27 INFO - 'tpaint', 02:11:27 INFO - 'sessionrestore', 02:11:27 INFO - 'sessionrestore_no_auto_restore', 02:11:27 INFO - 'tabpaint']}, 02:11:27 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['tsvgx', 02:11:27 INFO - 'tsvgr_opacity', 02:11:27 INFO - 'tart', 02:11:27 INFO - 'tscrollx', 02:11:27 INFO - 'cart']}, 02:11:27 INFO - 'svgr-e10s': {'tests': ['tsvgx', 02:11:27 INFO - 'tsvgr_opacity', 02:11:27 INFO - 'tart', 02:11:27 INFO - 'tscrollx', 02:11:27 INFO - 'cart']}, 02:11:27 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:11:27 INFO - 'talos_options': ['--disable-e10s'], 02:11:27 INFO - 'tests': ['tp5o']}, 02:11:27 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:11:27 INFO - 'tests': ['tp5o']}, 02:11:27 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:11:27 INFO - 'talos_options': ['--disable-e10s', 02:11:27 INFO - '--xperf_path', 02:11:27 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:11:27 INFO - 'tests': ['tp5n']}, 02:11:27 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:11:27 INFO - 'talos_options': ['--xperf_path', 02:11:27 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:11:27 INFO - 'tests': ['tp5n']}}, 02:11:27 INFO - 'talos.zip': {'path': '', 02:11:27 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 02:11:27 INFO - Running post-action listener: _resource_record_post_action 02:11:27 INFO - [mozharness: 2016-09-28 09:11:27.788744Z] Finished populate-webroot step (success) 02:11:27 INFO - [mozharness: 2016-09-28 09:11:27.788877Z] Running create-virtualenv step. 02:11:27 INFO - Running pre-action listener: _resource_record_pre_action 02:11:27 INFO - Running main action method: create_virtualenv 02:11:27 INFO - Creating virtualenv /builds/slave/test/build/venv 02:11:27 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 02:11:27 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 02:11:27 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:11:27 INFO - Using real prefix '/tools/python27' 02:11:27 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:11:28 INFO - Installing distribute.............................................................................................................................................................................................done. 02:11:31 INFO - Installing pip.................done. 02:11:31 INFO - Return code: 0 02:11:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 02:11:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 02:11:31 INFO - Reading from file tmpfile_stdout 02:11:31 INFO - Output received: 02:11:31 INFO - pip 1.5.5 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 02:11:31 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:11:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 02:11:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 02:11:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:31 INFO - 'HOME': '/Users/cltbld', 02:11:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:31 INFO - 'LOGNAME': 'cltbld', 02:11:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:31 INFO - 'MOZ_NO_REMOTE': '1', 02:11:31 INFO - 'NO_EM_RESTART': '1', 02:11:31 INFO - 'PAGER': '/bin/cat', 02:11:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:31 INFO - 'PWD': '/builds/slave/test', 02:11:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:31 INFO - 'SHELL': '/bin/bash', 02:11:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:31 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:31 INFO - 'USER': 'cltbld', 02:11:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:31 INFO - 'XPC_FLAGS': '0x0', 02:11:31 INFO - 'XPC_SERVICE_NAME': '0', 02:11:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:32 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 02:11:32 INFO - Cleaning up... 02:11:32 INFO - Return code: 0 02:11:32 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 02:11:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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>=3.1.1'] in /builds/slave/test/build 02:11:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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>=3.1.1 02:11:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:32 INFO - 'HOME': '/Users/cltbld', 02:11:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:32 INFO - 'LOGNAME': 'cltbld', 02:11:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:32 INFO - 'MOZ_NO_REMOTE': '1', 02:11:32 INFO - 'NO_EM_RESTART': '1', 02:11:32 INFO - 'PAGER': '/bin/cat', 02:11:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:32 INFO - 'PWD': '/builds/slave/test', 02:11:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:32 INFO - 'SHELL': '/bin/bash', 02:11:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:32 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:32 INFO - 'USER': 'cltbld', 02:11:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:32 INFO - 'XPC_FLAGS': '0x0', 02:11:32 INFO - 'XPC_SERVICE_NAME': '0', 02:11:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:32 INFO - Downloading/unpacking psutil>=3.1.1 02:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:11:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:11:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:11:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:11:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:11:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:11:35 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:11:35 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:11:35 INFO - Installing collected packages: psutil 02:11:35 INFO - Running setup.py install for psutil 02:11:36 INFO - building 'psutil._psutil_osx' extension 02:11:36 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 02:11:36 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 02:11:36 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 02:11:36 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 02:11:36 INFO - building 'psutil._psutil_posix' extension 02:11:36 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 02:11:36 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 02:11:36 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 02:11:36 INFO - ^ 02:11:36 INFO - 1 warning generated. 02:11:36 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 02:11:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:11:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:11:37 INFO - Successfully installed psutil 02:11:37 INFO - Cleaning up... 02:11:37 INFO - Return code: 0 02:11:37 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 02:11:37 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:37 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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.3'] in /builds/slave/test/build 02:11:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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.3 02:11:37 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:37 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:37 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:37 INFO - 'HOME': '/Users/cltbld', 02:11:37 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:37 INFO - 'LOGNAME': 'cltbld', 02:11:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:37 INFO - 'MOZ_NO_REMOTE': '1', 02:11:37 INFO - 'NO_EM_RESTART': '1', 02:11:37 INFO - 'PAGER': '/bin/cat', 02:11:37 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:37 INFO - 'PWD': '/builds/slave/test', 02:11:37 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:37 INFO - 'SHELL': '/bin/bash', 02:11:37 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:37 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:37 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:37 INFO - 'USER': 'cltbld', 02:11:37 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:37 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:37 INFO - 'XPC_FLAGS': '0x0', 02:11:37 INFO - 'XPC_SERVICE_NAME': '0', 02:11:37 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:37 INFO - Downloading/unpacking mozsystemmonitor==0.3 02:11:37 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 02:11:37 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 02:11:37 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 02:11:37 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 02:11:37 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 02:11:37 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 02:11:39 INFO - Downloading mozsystemmonitor-0.3.tar.gz 02:11:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:11:39 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 02:11:39 INFO - Installing collected packages: mozsystemmonitor 02:11:39 INFO - Running setup.py install for mozsystemmonitor 02:11:40 INFO - Successfully installed mozsystemmonitor 02:11:40 INFO - Cleaning up... 02:11:40 INFO - Return code: 0 02:11:40 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 02:11:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema==2.5.1'] in /builds/slave/test/build 02:11:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 jsonschema==2.5.1 02:11:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:40 INFO - 'HOME': '/Users/cltbld', 02:11:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:40 INFO - 'LOGNAME': 'cltbld', 02:11:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:40 INFO - 'MOZ_NO_REMOTE': '1', 02:11:40 INFO - 'NO_EM_RESTART': '1', 02:11:40 INFO - 'PAGER': '/bin/cat', 02:11:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:40 INFO - 'PWD': '/builds/slave/test', 02:11:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:40 INFO - 'SHELL': '/bin/bash', 02:11:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:40 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:40 INFO - 'USER': 'cltbld', 02:11:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:40 INFO - 'XPC_FLAGS': '0x0', 02:11:40 INFO - 'XPC_SERVICE_NAME': '0', 02:11:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:40 INFO - Downloading/unpacking jsonschema==2.5.1 02:11:40 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 02:11:40 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 02:11:40 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 02:11:40 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 02:11:40 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 02:11:40 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 02:11:42 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:11:42 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 02:11:42 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 02:11:42 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 02:11:42 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 02:11:42 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 02:11:42 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 02:11:42 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 02:11:43 INFO - Downloading functools32-3.2.3-2.tar.gz 02:11:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:11:43 INFO - warning: no files found matching '*.txt' 02:11:43 INFO - no previously-included directories found matching 'build' 02:11:43 INFO - no previously-included directories found matching 'dist' 02:11:43 INFO - no previously-included directories found matching '.git*' 02:11:43 INFO - Installing collected packages: jsonschema, functools32 02:11:43 INFO - Running setup.py install for functools32 02:11:43 INFO - warning: no files found matching '*.txt' 02:11:43 INFO - no previously-included directories found matching 'build' 02:11:43 INFO - no previously-included directories found matching 'dist' 02:11:43 INFO - no previously-included directories found matching '.git*' 02:11:43 INFO - Successfully installed jsonschema functools32 02:11:43 INFO - Cleaning up... 02:11:43 INFO - Return code: 0 02:11:43 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 02:11:43 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:43 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'functools32==3.2.3-2'] in /builds/slave/test/build 02:11:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 functools32==3.2.3-2 02:11:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:43 INFO - 'HOME': '/Users/cltbld', 02:11:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:43 INFO - 'LOGNAME': 'cltbld', 02:11:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:43 INFO - 'MOZ_NO_REMOTE': '1', 02:11:43 INFO - 'NO_EM_RESTART': '1', 02:11:43 INFO - 'PAGER': '/bin/cat', 02:11:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:43 INFO - 'PWD': '/builds/slave/test', 02:11:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:43 INFO - 'SHELL': '/bin/bash', 02:11:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:43 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:43 INFO - 'USER': 'cltbld', 02:11:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:43 INFO - 'XPC_FLAGS': '0x0', 02:11:43 INFO - 'XPC_SERVICE_NAME': '0', 02:11:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:43 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 02:11:43 INFO - Cleaning up... 02:11:43 INFO - Return code: 0 02:11:43 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:11:43 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:43 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 02:11:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 02:11:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:43 INFO - 'HOME': '/Users/cltbld', 02:11:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:43 INFO - 'LOGNAME': 'cltbld', 02:11:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:43 INFO - 'MOZ_NO_REMOTE': '1', 02:11:43 INFO - 'NO_EM_RESTART': '1', 02:11:43 INFO - 'PAGER': '/bin/cat', 02:11:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:43 INFO - 'PWD': '/builds/slave/test', 02:11:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:43 INFO - 'SHELL': '/bin/bash', 02:11:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:43 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:43 INFO - 'USER': 'cltbld', 02:11:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:43 INFO - 'XPC_FLAGS': '0x0', 02:11:43 INFO - 'XPC_SERVICE_NAME': '0', 02:11:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:44 INFO - Downloading/unpacking blobuploader==1.2.4 02:11:44 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 02:11:44 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 02:11:44 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 02:11:44 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 02:11:44 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 02:11:44 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 02:11:46 INFO - Downloading blobuploader-1.2.4.tar.gz 02:11:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:11:46 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:11:46 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 02:11:46 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 02:11:46 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 02:11:46 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 02:11:46 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 02:11:46 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 02:11:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:11:47 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:11:47 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 02:11:47 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 02:11:47 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 02:11:47 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 02:11:47 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 02:11:47 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 02:11:47 INFO - Downloading docopt-0.6.1.tar.gz 02:11:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:11:47 INFO - Installing collected packages: blobuploader, requests, docopt 02:11:47 INFO - Running setup.py install for blobuploader 02:11:48 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:11:48 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:11:48 INFO - Running setup.py install for requests 02:11:48 INFO - Running setup.py install for docopt 02:11:48 INFO - Successfully installed blobuploader requests docopt 02:11:48 INFO - Cleaning up... 02:11:48 INFO - Return code: 0 02:11:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:11:48 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:48 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 02:11:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --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 02:11:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:48 INFO - 'HOME': '/Users/cltbld', 02:11:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:48 INFO - 'LOGNAME': 'cltbld', 02:11:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:48 INFO - 'MOZ_NO_REMOTE': '1', 02:11:48 INFO - 'NO_EM_RESTART': '1', 02:11:48 INFO - 'PAGER': '/bin/cat', 02:11:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:48 INFO - 'PWD': '/builds/slave/test', 02:11:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:48 INFO - 'SHELL': '/bin/bash', 02:11:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:48 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:48 INFO - 'USER': 'cltbld', 02:11:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:48 INFO - 'XPC_FLAGS': '0x0', 02:11:48 INFO - 'XPC_SERVICE_NAME': '0', 02:11:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-VjeUwq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-oDyJeB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-YvG1IW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-aFD8qH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-yRzEz_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-RItdaR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-BURnm5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-dcAKAB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:11:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:11:49 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-rSizq2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:11:50 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-7dE03S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:11:50 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-fEeYG2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:11:50 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-xwBTna-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:11:50 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-Ny6GdY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:11:50 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-SvZd5J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:11:50 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-njzkOo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:11:50 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-nE5ynD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:11:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:11:50 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-1zljM7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:11:50 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:11:50 INFO - Running setup.py install for manifestparser 02:11:51 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:11:51 INFO - Running setup.py install for mozcrash 02:11:51 INFO - Running setup.py install for mozdebug 02:11:51 INFO - Running setup.py install for mozdevice 02:11:51 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 02:11:51 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:11:51 INFO - Running setup.py install for mozfile 02:11:51 INFO - Running setup.py install for mozhttpd 02:11:51 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:11:51 INFO - Running setup.py install for mozinfo 02:11:51 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:11:51 INFO - Running setup.py install for mozInstall 02:11:52 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Running setup.py install for mozleak 02:11:52 INFO - Running setup.py install for mozlog 02:11:52 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Running setup.py install for moznetwork 02:11:52 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Running setup.py install for mozprocess 02:11:52 INFO - Running setup.py install for mozprofile 02:11:52 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:11:52 INFO - Running setup.py install for mozrunner 02:11:53 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:11:53 INFO - Running setup.py install for mozscreenshot 02:11:53 INFO - Running setup.py install for moztest 02:11:53 INFO - Running setup.py install for mozversion 02:11:53 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:11:53 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:11:53 INFO - Cleaning up... 02:11:53 INFO - Return code: 0 02:11:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:11:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 02:11:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 02:11:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:53 INFO - 'HOME': '/Users/cltbld', 02:11:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:53 INFO - 'LOGNAME': 'cltbld', 02:11:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:53 INFO - 'MOZ_NO_REMOTE': '1', 02:11:53 INFO - 'NO_EM_RESTART': '1', 02:11:53 INFO - 'PAGER': '/bin/cat', 02:11:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:53 INFO - 'PWD': '/builds/slave/test', 02:11:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:53 INFO - 'SHELL': '/bin/bash', 02:11:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:53 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:53 INFO - 'USER': 'cltbld', 02:11:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:53 INFO - 'XPC_FLAGS': '0x0', 02:11:53 INFO - 'XPC_SERVICE_NAME': '0', 02:11:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:11:53 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-kM89t2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:11:53 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)) 02:11:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:11:53 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-40MZYu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-Q_6SFl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:11:54 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-1XsS_W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-74aDWq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:11:54 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-tuwjWw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:11:54 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-3c3j2m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:11:54 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-CrnaxH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:11:54 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-binaF7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:11:54 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-ZGXHGI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-yGGO53-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:11:54 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)) 02:11:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:11:54 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-02aeJ9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:11:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 02:11:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:11:55 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-SNyXXk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:11:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 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)) 02:11:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:11:55 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-LIt9BW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:11:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 02:11:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:11:55 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-EYPVt9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:11:55 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)) 02:11:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:11:55 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-jAWm9O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:11:55 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)) 02:11:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:11:55 INFO - Running setup.py (path:/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/pip-TkM9nF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:11:55 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)) 02:11:55 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 02:11:55 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 02:11:55 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)) 02:11:55 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:11:55 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:11:55 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:11:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:11:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:11:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:11:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:11:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:11:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:11:58 INFO - Downloading blessings-1.6.tar.gz 02:11:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:11:58 INFO - Installing collected packages: blessings 02:11:58 INFO - Running setup.py install for blessings 02:11:58 INFO - Successfully installed blessings 02:11:58 INFO - Cleaning up... 02:11:58 INFO - Return code: 0 02:11:58 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:11:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:11:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:11:58 INFO - Reading from file tmpfile_stdout 02:11:58 INFO - Current package versions: 02:11:58 INFO - blessings == 1.6 02:11:58 INFO - blobuploader == 1.2.4 02:11:58 INFO - docopt == 0.6.1 02:11:58 INFO - functools32 == 3.2.3-2 02:11:58 INFO - jsonschema == 2.5.1 02:11:58 INFO - manifestparser == 1.1 02:11:58 INFO - mozInstall == 1.12 02:11:58 INFO - mozcrash == 0.17 02:11:58 INFO - mozdebug == 0.1 02:11:58 INFO - mozdevice == 0.48 02:11:58 INFO - mozfile == 1.2 02:11:58 INFO - mozhttpd == 0.7 02:11:58 INFO - mozinfo == 0.9 02:11:58 INFO - mozleak == 0.1 02:11:58 INFO - mozlog == 3.4 02:11:58 INFO - moznetwork == 0.27 02:11:58 INFO - mozprocess == 0.23 02:11:58 INFO - mozprofile == 0.28 02:11:58 INFO - mozrunner == 6.12 02:11:58 INFO - mozscreenshot == 0.1 02:11:58 INFO - mozsystemmonitor == 0.3 02:11:58 INFO - moztest == 0.7 02:11:58 INFO - mozversion == 1.4 02:11:58 INFO - psutil == 3.1.1 02:11:58 INFO - requests == 1.2.3 02:11:58 INFO - wsgiref == 0.1.2 02:11:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:11:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 02:11:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 02:11:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:58 INFO - 'HOME': '/Users/cltbld', 02:11:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:58 INFO - 'LOGNAME': 'cltbld', 02:11:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:58 INFO - 'MOZ_NO_REMOTE': '1', 02:11:58 INFO - 'NO_EM_RESTART': '1', 02:11:58 INFO - 'PAGER': '/bin/cat', 02:11:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:58 INFO - 'PWD': '/builds/slave/test', 02:11:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:58 INFO - 'SHELL': '/bin/bash', 02:11:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:58 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:58 INFO - 'USER': 'cltbld', 02:11:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:58 INFO - 'XPC_FLAGS': '0x0', 02:11:58 INFO - 'XPC_SERVICE_NAME': '0', 02:11:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 02:11:58 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 2)) 02:11:58 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 3)) 02:11:58 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 4)) 02:11:58 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 5)) 02:11:58 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 6)) 02:11:58 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 7)) 02:11:58 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 8)) 02:11:58 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 9)) 02:11:58 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.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 02:11:58 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 4)) 02:11:58 INFO - Cleaning up... 02:11:58 INFO - Return code: 0 02:11:58 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:11:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:11:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:11:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:11:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:11:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e821490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e797570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcad2c84540>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 02:11:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema'] in /builds/slave/test/build 02:11:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 jsonschema 02:11:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:11:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:11:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:11:58 INFO - 'HOME': '/Users/cltbld', 02:11:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:11:58 INFO - 'LOGNAME': 'cltbld', 02:11:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:11:58 INFO - 'MOZ_NO_REMOTE': '1', 02:11:58 INFO - 'NO_EM_RESTART': '1', 02:11:58 INFO - 'PAGER': '/bin/cat', 02:11:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:11:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:11:58 INFO - 'PWD': '/builds/slave/test', 02:11:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:11:58 INFO - 'SHELL': '/bin/bash', 02:11:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:11:58 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:11:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:11:58 INFO - 'USER': 'cltbld', 02:11:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:11:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:11:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:11:58 INFO - 'XPC_FLAGS': '0x0', 02:11:58 INFO - 'XPC_SERVICE_NAME': '0', 02:11:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:11:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:11:59 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 02:11:59 INFO - Cleaning up... 02:11:59 INFO - Return code: 0 02:11:59 INFO - Running post-action listener: _resource_record_post_action 02:11:59 INFO - Running post-action listener: _start_resource_monitoring 02:11:59 INFO - Starting resource monitoring. 02:11:59 INFO - [mozharness: 2016-09-28 09:11:59.247038Z] Finished create-virtualenv step (success) 02:11:59 INFO - [mozharness: 2016-09-28 09:11:59.248068Z] Running install step. 02:11:59 INFO - Running pre-action listener: _resource_record_pre_action 02:11:59 INFO - Running main action method: install 02:11:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:11:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:11:59 INFO - Reading from file tmpfile_stdout 02:11:59 INFO - Detecting whether we're running mozinstall >=1.0... 02:11:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:11:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:11:59 INFO - Reading from file tmpfile_stdout 02:11:59 INFO - Output received: 02:11:59 INFO - Usage: mozinstall [options] installer 02:11:59 INFO - Options: 02:11:59 INFO - -h, --help show this help message and exit 02:11:59 INFO - -d DEST, --destination=DEST 02:11:59 INFO - Directory to install application into. [default: 02:11:59 INFO - "/builds/slave/test"] 02:11:59 INFO - --app=APP Application being installed. [default: firefox] 02:11:59 INFO - mkdir: /builds/slave/test/build/application 02:11:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 02:11:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 02:12:33 INFO - Reading from file tmpfile_stdout 02:12:33 INFO - Output received: 02:12:33 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 02:12:33 INFO - Running post-action listener: _resource_record_post_action 02:12:33 INFO - [mozharness: 2016-09-28 09:12:33.819918Z] Finished install step (success) 02:12:33 INFO - [mozharness: 2016-09-28 09:12:33.820045Z] Running run-tests step. 02:12:33 INFO - Running pre-action listener: _resource_record_pre_action 02:12:33 INFO - Running main action method: run_tests 02:12:33 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 02:12:33 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 02:12:33 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 02:12:33 INFO - 2016-09-28 02:12:33.834 screenresolution[1651:9648] starting screenresolution argv=screenresolution get 02:12:33 INFO - 2016-09-28 02:12:33.837 screenresolution[1651:9648] Display 0: 1600x1200x32@60 02:12:33 INFO - 2016-09-28 02:12:33.843 screenresolution[1652:9650] starting screenresolution argv=screenresolution list 02:12:33 INFO - Available Modes on Display 0 02:12:33 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 02:12:33 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 02:12:33 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 02:12:33 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 02:12:34 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 02:12:34 INFO - Intel Iris: 02:12:34 INFO - Chipset Model: Intel Iris 02:12:34 INFO - Type: GPU 02:12:34 INFO - Bus: Built-In 02:12:34 INFO - VRAM (Dynamic, Max): 1536 MB 02:12:34 INFO - Vendor: Intel (0x8086) 02:12:34 INFO - Device ID: 0x0a2e 02:12:34 INFO - Revision ID: 0x0009 02:12:34 INFO - Displays: 02:12:34 INFO - Display: 02:12:34 INFO - Resolution: 1600 x 1200 @ 60 Hz 02:12:34 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 02:12:34 INFO - Display Serial Number: 1600x1200 60 02:12:34 INFO - Main Display: Yes 02:12:34 INFO - Mirror: Off 02:12:34 INFO - Online: Yes 02:12:34 INFO - Rotation: Supported 02:12:34 INFO - Return code: 0 02:12:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:12:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:12:34 INFO - Python 2.7.3 02:12:34 INFO - Return code: 0 02:12:34 INFO - grabbing minidump binary from tooltool 02:12: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:12:34 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e635d30>, '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 0x10e45bdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e62db20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:12:34 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 02:12:34 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 02:12:34 INFO - Calling ['/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'] with output_timeout 600 02:12:34 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:12:34 INFO - Return code: 0 02:12:34 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 02:12:34 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:12:34 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:12:34 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 02:12:34 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:12:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0202', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 02:12:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0202 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 02:12:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ce3Q17BBZ9/Render', 02:12:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 02:12:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 02:12:34 INFO - 'HOME': '/Users/cltbld', 02:12:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 02:12:34 INFO - 'LOGNAME': 'cltbld', 02:12:34 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:12:34 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 02:12:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:12:34 INFO - 'MOZ_NO_REMOTE': '1', 02:12:34 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:12:34 INFO - 'NO_EM_RESTART': '1', 02:12:34 INFO - 'PAGER': '/bin/cat', 02:12:34 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 02:12:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:12:34 INFO - 'PWD': '/builds/slave/test', 02:12:34 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:12:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 02:12:34 INFO - 'SHELL': '/bin/bash', 02:12:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.0oCf1C1Y0R/Listeners', 02:12:34 INFO - 'TMPDIR': '/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/', 02:12:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 02:12:34 INFO - 'USER': 'cltbld', 02:12:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 02:12:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 02:12:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:12:34 INFO - 'XPC_FLAGS': '0x0', 02:12:34 INFO - 'XPC_SERVICE_NAME': '0', 02:12:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 02:12:34 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0202', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 02:12:34 INFO - mozversion application_buildid: 20160928011020 02:12:34 INFO - mozversion application_changeset: 45513d6773f099db66f0cd7bf1e312f6f9d11475 02:12:34 INFO - mozversion application_display_name: Nightly 02:12:34 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:12:34 INFO - mozversion application_name: Firefox 02:12:34 INFO - mozversion application_remotingname: firefox 02:12:34 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 02:12:34 INFO - mozversion application_vendor: Mozilla 02:12:34 INFO - mozversion application_version: 52.0a1 02:12:34 INFO - mozversion platform_buildid: 20160928011020 02:12:34 INFO - mozversion platform_changeset: 45513d6773f099db66f0cd7bf1e312f6f9d11475 02:12:34 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 02:12:34 INFO - mozversion platform_version: 52.0a1 02:12:34 INFO - using testdate: 1475053954 02:12:34 INFO - actual date: 1475053954 02:12:34 INFO - starting webserver on 'localhost:49274' 02:12:34 INFO - SUITE-START | Running 2 tests 02:12:34 INFO - TEST-START | dromaeo_css 02:12:34 INFO - operating with platform_type : mac_ 02:12:34 INFO - Initialising browser for dromaeo_css test... 02:12:34 INFO - TEST-INFO | started process 1662 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/tmpzCcARf/profile http://localhost:49274/getInfo.html) 02:12:37 INFO - PROCESS | 1662 | __metrics Screen width/height:1600/1200 02:12:37 INFO - PROCESS | 1662 | colorDepth:24 02:12:37 INFO - PROCESS | 1662 | Browser inner width/height: 1024/689 02:12:37 INFO - PROCESS | 1662 | __metrics 02:12:37 INFO - PROCESS | 1662 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 02:12:37 INFO - PROCESS | 1662 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 02:12:38 INFO - TEST-INFO | 1662: exit 0 02:12:38 INFO - Browser initialized. 02:12:38 INFO - Running cycle 1/1 for dromaeo_css test... 02:12:38 INFO - TEST-INFO | started process 1665 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/tmpzCcARf/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:12:50 INFO - PROCESS | 1665 | RSS: Main: 235601920 02:12:50 INFO - PROCESS | 1665 | 02:13:41 INFO - PROCESS | 1665 | 1475054021588 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] 02:15:53 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49274/tests/dromaeo/cssquery-ext.html) 02:15:54 INFO - PROCESS | 1665 | RSS: Main: 383123456 02:15:54 INFO - PROCESS | 1665 | 02:18:57 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-ext.html (next: http://localhost:49274/tests/dromaeo/cssquery-jquery.html) 02:18:58 INFO - PROCESS | 1665 | RSS: Main: 373932032 02:18:58 INFO - PROCESS | 1665 | 02:22:00 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49274/tests/dromaeo/cssquery-mootools.html) 02:22:01 INFO - PROCESS | 1665 | RSS: Main: 339050496 02:22:01 INFO - PROCESS | 1665 | 02:25:03 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49274/tests/dromaeo/cssquery-prototype.html) 02:25:04 INFO - PROCESS | 1665 | RSS: Main: 355876864 02:25:04 INFO - PROCESS | 1665 | 02:28:07 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49274/tests/dromaeo/cssquery-yui.html) 02:28:08 INFO - PROCESS | 1665 | RSS: Main: 333856768 02:28:08 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | Cycle 1(1): loaded http://localhost:49274/tests/dromaeo/cssquery-yui.html (next: http://localhost:49274/tests/dromaeo/cssquery-dojo.html) 02:31:11 INFO - PROCESS | 1665 | RSS: Main: 506818560 02:31:11 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | __start_tp_report 02:31:11 INFO - PROCESS | 1665 | _x_x_mozilla_page_load 02:31:11 INFO - PROCESS | 1665 | _x_x_mozilla_page_load_details 02:31:11 INFO - PROCESS | 1665 | |i|pagename|runs| 02:31:11 INFO - PROCESS | 1665 | |0;dojo.html;2747.9862600686993;3291.42400079986;3304.438245498265;3372.443546814776;3381.56039714837;5438.700871452069;5566.248556444879;5596.9160462593045;5642.746076426561;5647.29408823897;5546.473085056913;5561.388247292804;5672.262605861242;5676.347220069693;5703.03048481757;5075.7715902784275;5088.745562721868;5112.130937740574;5163.1480805667015;5171.3535808024;5098.362704661918;5105.770240339175;5106.5659418949435;5148;5172.715500647463;5042.647014708972;5062.417821950449;5097.821576244833;5115.386153661547;5127.9230811537855;4870.366852309213;4990.652523818585;5021.59827213822;5110.10573149701;5142.845714628567;5058.494150584949;5099.974500127512;5129.717865517395;5133.486651334874;5140.871478213075;5504.091824848895;5549.750261238254;5581.49766521015;5584.246126772874;5586.525145362649;6059.697015149269;6066.545009124289;6080.0575910733905;6144.678894037758;6160.907586386208;6179.351168127327;6190.628562286277;6218.81343559694;6240.875182496325;6250.468710159642;5565.193047008162;5617.943820561783;5687.43125687428;5694.9430505695245;5726.055200891807;6153.600015999035;6183.072539119168;6194.845128871814;6246.625202487774;6260.530460215502;6007.128966299862;6018.307894592091;6022.967422943478;6027.306859711101;6091.878162436727;6152.876942461216;6191.473724733448;6191.597546159485;6203.7828675996125;6211.09939058834;5886.558508111909;5919.792807251725;5920.79277225295;6027.819165425044;6089.147519347295;6123.496151642696;6134.209553866654;6134.423542112324;6141.942449279452;6151.72317245725;4740.810367585258;4818.180909245437;4852.199387101159;4877.756112194376;4900.117978763786;4350.477942646839;4356.651467882625;4375.47494300686;4401.163778882066;4413.867583972486;5626;5683.090705487102;5693.060644993612;5709.086546152679;5757.596968212185;5375.569954403638;6198.287196972406;6209.65846878417;6213.254409470893;6231.283402408781;5161.458046905096;5533.474319939599;5549.889002219933;5700.37295897451;5716.599838011382;5181.35233095863;5266.47335266478;5306.7611957462;5313.654612450256;5317.042932272151;6262.248530176317;6278.246610406781;6294.527910406646;6312.968435157978;6331.873362532816;6220.968895155495;6229.657368844757;6235.407636274546;6237.4698150657705;6245.125682404558;5205.869853253699;6115.270764408881;6212.844678883064;6241.594296370721;6281.246250449975;6106.36966090081;6142.508599312134;6144.846378840565;6148.723307451265;6156.538259630456;6186.721597528032;6196.566240363131;6198.504119670506;6199.721012554356;6218.751249949952;5822.912656310244;5886.440788125121;5905.291365036223;5992.610480318765;5995.790147344822;5212.322398088224;5883.61756485827;5977.641341519523;6000.429959154048;6046.27444706638;5810;5818.185454036523;5819;5829;5831.212786273799;5435.2934118564335;5808.593398462236;5851.1223316502865;5942.524598032233;6019.4883434908525;5149.459306772885;5743.310802703702;5783.334916484658;5808.332041815076;5814.476697097112 02:31:11 INFO - PROCESS | 1665 | |1;ext.html;467.54180902715336;489.7967343552425;523.5628250410907;528.207688467299;552.682207730555;28339.999999999975;39859.80070099649;40495.19009619806;40579.79710101453;40742;34820.477692834625;42140.57859421405;42419.939501512476;42521.574784252145;42735.93160170997;8647.135286471366;9410.858837117448;9810.313278070538;9812.852807207897;9814.165795907356;8761.56192190391;11870.821937670942;12104.152709310309;12115.697107572292;12230.571929982452;11572.942135289311;11604.883951160507;11772;11867.109966752485;12009.039276857875;11748.706282342968;11819.409029548488;11827.526898924032;11876.52493900243;11909.94045029778;11713.590024349107;11792.469338879771;11799.941000294944;11806;11810.763784724257;40104.79947600273;40215.79892100521;40399.59600403988;40411;40422.59577404218;3263.7225835803984;3303.4714445688574;3354.077628652116;3476.1483436558206;3503.649635036476;24624.630630540556;24643.87678061598;29667;31190.844045779624;31321.686783132103;2661.614065960425;3167.010799328559;3203.5194720791833;3218.2758879251983;3296.1924328539662;379912;382319.9999999972;383453;385475.21787172934;385574.0721296404;55059.44940550623;55089.898202035736;55118.72440637771;55186;55208;33873.15317117092;34084.65915340865;34350.312993739986;58802.705986469795;59075.113873291935;15763.842361576237;16144.596385090466;16151.596210094607;16167.434139805051;16200.594985125466;11386.316820990767;11618.360990145624;11641.952224299854;12476.75046499065;12572.308523031139;16432.096234707205;16499.6700065998;16554.58613534671;18333.449996500127;18715.064246787606;6988.825279368057;7781.638213312761;7837.451378403457;8015.919840801517;8018.278354948083;823.798169448477;882.289756745813;961.1925982174866;1004.9246306526893;1022.6216299969059;25412.221144519706;25553.744462555507;29033;29597.26006849846;30099.548506772415;833.8582440984926;929.1962452478692;998.6654470752234;1077.9411324370415;1106.2311693373028;13017.739645207042;14862.331195096247;15443.830165855155;15475.613109672124;15877.682446351007;192548;192601;192895;193476;194024;56231.718841405534;56614;56751.71624141935;56784.716076420176;56920.715396422755;1221.62740364188;1251.5682089679228;1332.47367289918;1356.328617334406;1359.8708122728326;26429.942802287693;27220.591691125046;29129.708702913547;30282.242943925696;30743;46930;47306.29040564463;47375.76312118417;47424;47441.81395465141;536794;538646;539209;539916;542095.2895235498;25559.744402555738;26304.21087367382;26659.466810664067;26744;27872.44255114927;36769;46246.768766155954;46958;47024.7648761754;47236.05527889491;37904.810475947445;38148.42777358397;38526.03684907788;38791;39020.804895975336;37500.62499374971;37597.43603845999;37684.811575941945;38415;38823.805880970416;37558.2488350226;37926.810365948;37958.24083518369;38237.808810955765;38805.2238955225;27926.60366981602;28190.577141343307;30715;32491.187720306236;34473;25076.247712568653;25162.112841536593;25209.24372268835;25504.107356242443;26042.73957260403 02:31:11 INFO - PROCESS | 1665 | |2;jquery.html;345.67506543848793;365.5430711610487;373.46967306424864;374.3542389378323;402.41046866340804;15092.47176348828;15233.999999999985;16506.669866602675;20763.377098687026;21356.03897824598;19817;20721;21333.573328533457;21466.89266553669;21733;4479.708818926776;5915.852103697421;6166.568340216187;6175.289841668198;6178.536609754264;6702.7654032108885;6866.690998905061;6917.204521480044;6927.168739751211;6946.583205007691;6634.038064480647;6756;6757.864842703168;6764.898526522106;6850.657467126649;6502.382273684039;6764.120664313657;6810.693518791617;6812.931870681304;6824.624645644488;5817.476427121579;5897.557683173736;5898.941010589882;5908.202392676976;5908.852278693024;25726.6141007885;25969.480610387876;25984.610230846552;26117.955281788705;26516.20451386442;2252.3468194223656;2561.2828408045775;2669.466106778652;2800.2999250187454;2836.82271857179;15854.603634909105;15900;16101.389861013922;16234.10712410817;16547.255373508102;1886.7169924511434;1914.7702275726863;1920.807919208068;1960.2942940541393;1966.783653798081;110118;114456;117809;118439.4078029613;118524;10933.617323393642;10959.452027398758;11026.117910567136;11043.282186657842;11406.201565890307;14064.367103480368;14073.225972571607;14077.606806842861;14079.014468987072;14105.858941410455;8524.275436587835;8691.304695624334;8710.477371357612;8735.388522803343;8878.86681699775;8660.523671198018;8682.52246126469;8694.521801300863;8818.51498167607;8869.955650221707;5967.433093856077;6644.003399490115;6729.932700673028;6801.4558835293055;6854.2117656469145;1746.449868291484;1827.4883032750852;1834.5415394761196;1837.6232872261155;1838.8436982856606;871.0375035585713;882.2016075451727;1032.8380571856662;1035.8498017787379;1043.0977204718015;19679.60640787176;21174.364769056952;22521.549569008526;23033.424164396023;23072.192473263356;767.2902565127235;933.4912472702393;937.7983733497331;991.3407583956588;1021.4790456867051;11507.02190313816;11917.642470725892;12126.27242365461;12153.453094610764;12215.511379544896;574198;577785;577954;587712;592171.2348629548;116767;116836.41581792207;116841.22726841303;119512.40243798726;124365.75634243722;1001.1890368801148;1044.4568824211367;1069;1072.5066469424153;1073.6242315189777;15603.92198039048;20174.58777885534;20295.46306711661;20334.084966176262;20400.693989590465;51289.15331350089;51947.74026129845;53522;53556.79739082052;53683.19475207797;57887.421125788205;66427.00718978439;73473;73818.52362952818;74051.88922166065;6103.938960610337;7276.854462910818;7452.962735186289;7591.278828511283;7727.343175829893;10299.3820370778;13362;13398.464061437433;13883;13965.720685586435;11414.942925285653;11684.47419866125;11929.940350298193;11958.46186921608;11999.220050696676;11219.326840389276;11264.324140551593;11346.149038821955;11461.338105974753;11883.881161188277;11669.474873630537;11722.608457302404;11941.343226122646;11962.521499139937;11995.340256285988;5416.404195538409;7472.40220782347;7524.473286869867;7555.962220188864;7813.1405545388825;11255.324680519196;11612.419379030845;11755.9138284938;11941.104417168921;11943.522259109539 02:31:11 INFO - PROCESS | 1665 | |3;mootools.html;1371.938262778175;1502.1437780465135;1557.6417423992482;1774.1661419133004;1941.1264930781151;7923.168067352932;8397.664093436262;8766.605502752383;9033.819323613523;9059.818803623924;7529.47293689442;8986.775330616721;8993.280537556997;9003;9005.099490050992;2408.5182963407347;2430.6718592989987;2434.5374378868046;2437.7805997460223;2438.244144315268;2364.219807463533;2414.553307638084;2419.697537807774;2420.044082587377;2431.0397393029743;2056.475598722324;2379.7263314718857;2398.95202095958;2408.650745641881;2420.298113547069;2368.561816064034;2386.2721869829693;2389.82076344274;2397.137030668958;2409.903603855844;2352.929412117639;2373.169390713254;2373.299876536426;2377.91677291294;2382.5234953009467;8932.419392739515;8936.955315223382;9004.954975225148;9036.096390360977;9053.637854485813;5201.739913004335;5258.3689957205;5403.675779453245;5427.3215848019;5437.537809286216;3395.47370157626;3517.9648203517895;3591.8742844000594;3601.621829707869;3605.170810713524;1046.576136664652;1050.453764042701;1067.909227715645;1071.9142468602492;1080.6920027792041;11212.159088068427;11505.367204803733;11653.53385864573;11791.587294444738;11839.348835814113;3864.7101467390057;4534.0478499515475;4584.358189853423;4628.722276663411;4663.114008338405;9207.723768286962;9207.961372746977;9214.723558293263;9225.72322830316;9229;5149.562287205555;5242.423333433319;5246.0557099721655;5246.291750613695;5247.950409918031;3730.850765969385;4135.793210339471;4397.2085024695225;4559.361689363492;4915.066137433876;3753.718471114623;3797.2025874566652;3806.600306967784;3846.3653497172654;3853.5761066282685;1159.837622732818;1166.2477701882408;1166.6849950513315;1178.1222988873344;1178.7347846734588;847.8346722389075;870.3124531619949;898.81574277273;915.7756349694367;939.6006697153682;5776.191333213354;5824.883502330014;6060.000099983454;6102.481289090389;6237.438630523275;721.4985585018362;911.4485736129546;963.1235575626287;988.9862890537113;1018.1905385218769;3805.6194380562274;3969.801509924492;3981.92036159281;4087.529934057562;4105.69207309447;10498.317609355367;10748.301360411548;10861.40262285582;10867;10884.836727449094;10818.404987725751;10826.133909287395;10834.404107774148;10845.783084338269;10861.728456788644;8226.383021273428;8312.960879890014;8345.916540834514;8351.248387645019;8359.498430094214;5731.7420716067045;5745.770169193185;5785.537157027512;6074.757009719562;6087.347142500624;9953.054459826304;10069.446180460145;10298.948505257726;10319.638812641522;10350.53422596;10389.636362727268;10427.791444170922;10520.842187367349;10522.736931576772;10578;6647.933520664731;6826.2832402599;6827.829304267433;6873.243943166348;6880.965595171992;8307.916920830714;8451.788705282417;8535.786605334917;8590.312774977861;8717;7549.811254718676;7581.393488521016;7594.544327340377;7631.885521717068;7711.575863327571;7388.926110738824;7502.587357695161;7516.887246691414;7532.096148462219;7561.659725312485;7070.646467676493;7106.324899134574;7185.820354491179;7197.784066478014;7204.135503739585;4977.800887964441;4987.251912213052;5120.820771272987;5151.484851514819;5306;5033.395992480926;5132.769025393941;5165.66423182492;5179.430262671179;5343.225232341367 02:31:11 INFO - PROCESS | 1665 | |4;prototype.html;261.48617965697406;293.86041630225634;301.56725099482236;306.3169132833781;309.88844016154195;5218.791248350066;5249.291345668338;5267.367915850104;5269.8155564555245;5309.920351194735;4391.758453285076;4972.477889821571;5017.19724844025;5109.335786347779;5302.416734159239;4018.6985976051915;4046.3930410438525;4063.4850854011215;4064.878053658395;4081.244969680611;3330.81680507572;3365.444701624229;3937.1338305572726;4024.557298697141;4058.7970601469956;3859.2281543691233;4016.758994460342;4019.5176578810438;4042.4830397554024;4057.3305404608204;4008.6392224699916;4014.698897582693;4028.9798551007057;4059.918801623966;4066.573009833969;2944.4847151748572;3325.451300535409;3463;3522.947155792665;3527.1887465882733;4566.474855391639;5119.206522988943;5138.203578445347;5224.712640804754;5232.816851410221;4238.152369526107;4245.532991370947;4488.842890498817;4511.661625378109;4559.475660299075;4866.7079975201605;5464.890702185974;5480.21892884814;5481.671099734029;5483.725813709299;2817.60553522507;2965.733084022448;3739.383001804699;3746.4754934309217;3781.3760729479604;4821.614270858323;5659;5736.168255602956;5760.855978600484;5770.653760774367;3765.9246815063543;3772.4152756322815;3773.6226377362595;3781.9243615128094;3790.2608991246443;3599.5500562429697;3613.223157021253;3830.7701537907815;3843.135294558758;3862.6909847212155;4320.395144679747;4475.641948644101;4489.349044388546;4499.887502812456;4543.227651299287;4300.526942036374;4518.480374756879;5439.246919625525;5497.39528651848;5536.785285885598;1180.86420061694;1240.7270400511873;1260.4895017517736;1312.4553310376086;1326.1313839434993;822.8518866604069;848.3849209323191;849.6473963305283;919.3013309884536;935.270489018553;4616.814398065324;4712.481627021025;4940.703557786473;5142.6914385137015;5255.973720131451;4592.173408786383;4990.276409920614;5679.119736440858;5683.914741278884;5759.222504961776;4569.2689169732685;4979.502049794992;5202.205239192473;5246.7638956247065;5250.212468129811;2380.6429035644446;2976.5535169724712;2985.328301132228;2998.6401631804324;3017.336186039068;4673.411040246333;5210.557102646242;5238.371395432497;5499.340079190522;5791.872388909941;4524.0094358482165;5864.530837532987;5882.588218824641;5932.970335148383;5976.372480889531;4377.365282034088;5185.974070129625;5712.999999999917;5874.882502349929;6083.695815209222;4610.423697037871;5728.341240757366;5789.1605717171615;5791.884162316815;5837.445442682938;4950.900981980269;5712.571557133148;5751.827445176651;5757.5681823864215;5758.445219790717;4968.701877887338;5914.408559144051;5930.703464826655;5964.522838172849;6028.698565071817;3117;3186;3421.4354631485526;3608.963910360863;3803.85884234734;5650.915236271377;5658.9151162733415;5664.49019588239;5670;5729.28383952006;4598;4750.952490475189;5511.58663100261;5541.224228607917;5570.749316280858;5280.419153893145;5305.867353316198;5374.355077390738;5474.397816240131;5587.792821835434;4536.274196128604;5505.532029777353;5507.201455788968;5510.504054635102;5571.721413929368;4642.187617166915;5178.43037265908;5404.270423492778;5433.728313584384;5525.618595351162;4724.385829842098;5519;5544.63959842609;5556.805511807067;5573.721313934206 02:31:11 INFO - PROCESS | 1665 | |5;yui.html;659.7657831469829;711.8825393810022;739.9334059934605;765.135397001388;803.6498682213878;15066.246687665614;15760.842391576081;15840.970336928107;15845.049297042186;15859.603509912244;14058.718825623482;14170.29148542574;14177;14177.07848989815;14210.502632407843;665.8668266346726;696.8257935516122;826.6528058215533;836.5900708652762;866.5710473315718;850.8681154421074;859.9484030958131;860.389123722158;861.0657436681208;864.4597126795753;906.9455832650029;909.3498148823589;909.6452383570413;911.2527727263647;911.444019148319;712.8324843661735;732.9267073292681;863.5121156546531;905.4702998745742;905.4793493741092;654.1463390275688;664.1963224498363;664.6975626090117;665.1253601514042;667.1860330396908;14936.32786524609;15064;15094.698106037928;15118.39526418942;15183.924080379638;13516.797248041188;13634.86365136346;13737.381817818223;13850.376733047036;13915.512957046454;12279.75440491194;12333.753324933452;12390.256584604953;12406.75186496274;12741.55404560836;4229.851955181553;4425.203463376591;4572.673924561873;4589.724616523019;4623.260278355447;112947;116972;118930.40534797357;120769;121775;10403.432795885437;10948.39783811882;10964.780704385868;10992.505337259843;11362.772744545227;19915.50275858647;20866;20870.478238043866;21442.463938401354;21487.785122148893;8047.994000749906;8096;8122;8137.674493020331;8282.792930176794;4418.425604671372;4476.46282446102;4510;4669.906601868011;4678.391809064799;3639.563252409675;3781.9977705907954;3782.7730336179916;3783.356829339019;3783.981080094582;653.9934600654028;675.6115233740619;690.8272931767058;696.2967402923084;699.597731304502;534.9572034237252;583.4515555377931;592.8132638219033;638.4030931079456;681.2914568848441;7875.842483150305;9019.503927283931;9577.521123943776;9655.468949207861;9762.902370976199;535.2613393516922;589.2310534752104;603.6378173096195;673.6631684157921;674.5413119079074;3930.5479869815335;4377.78111094444;4807.18277892759;4834.178189707688;4838.612910967114;91969;105788;148112;151983;154105;77301.61349193218;124802.37598812129;128791;128928;129655.70344296437;60071.69964150151;99872;100258.46252293522;107947.38078928822;110104.4494777537;9105.77235569116;9111.043340449158;9131.726048218565;9143.497107659143;9192.49441280736;46543.301850471595;50462;54681.45318546764;58229.4177058241;60329.69835150796;64112;92693;94156.52921735622;95533;96539.51730241303;11472.082233421474;11755.941220293844;11912;12174;12187.817182742088;10763.408012559072;12871.099023068295;12925.482980680668;13280.335983200994;13365.799513007507;11923.403829808649;12247.081468890046;12483.31341776211;12520.060995425198;12654.240745555297;11789.941050294694;11866.703332416413;11898.107641926717;11952.820707689218;12482.563110291096;13179.275139867015;13681.452741890213;13945.511907083204;14033;14039.859601404263;11276.097912167172;11290.661280161608;11359.608405772547;11552.768944620891;11685.415729213675;9211.76970575741;10359.32664376813;10402.248061245504;10725.479512314443;11523.481443334902 02:31:11 INFO - PROCESS | 1665 | __end_tp_report 02:31:11 INFO - PROCESS | 1665 | __start_cc_report 02:31:11 INFO - PROCESS | 1665 | _x_x_mozilla_cycle_collect,1436 02:31:11 INFO - PROCESS | 1665 | __end_cc_report 02:31:11 INFO - PROCESS | 1665 | __startTimestamp1475055071926__endTimestamp 02:31:11 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | ------- Summary: start ------- 02:31:11 INFO - PROCESS | 1665 | Number of tests: 6 02:31:11 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | [#0] dojo.html Cycles:165 Average:5626.27 Median:5808.33 stddev:650.17 (11.2%) stddev-sans-first:611.70 02:31:11 INFO - PROCESS | 1665 | Values: 2748.0 3291.4 3304.4 3372.4 3381.6 5438.7 5566.2 5596.9 5642.7 5647.3 5546.5 5561.4 5672.3 5676.3 5703.0 5075.8 5088.7 5112.1 5163.1 5171.4 5098.4 5105.8 5106.6 5148.0 5172.7 5042.6 5062.4 5097.8 5115.4 5127.9 4870.4 4990.7 5021.6 5110.1 5142.8 5058.5 5100.0 5129.7 5133.5 5140.9 5504.1 5549.8 5581.5 5584.2 5586.5 6059.7 6066.5 6080.1 6144.7 6160.9 6179.4 6190.6 6218.8 6240.9 6250.5 5565.2 5617.9 5687.4 5694.9 5726.1 6153.6 6183.1 6194.8 6246.6 6260.5 6007.1 6018.3 6023.0 6027.3 6091.9 6152.9 6191.5 6191.6 6203.8 6211.1 5886.6 5919.8 5920.8 6027.8 6089.1 6123.5 6134.2 6134.4 6141.9 6151.7 4740.8 4818.2 4852.2 4877.8 4900.1 4350.5 4356.7 4375.5 4401.2 4413.9 5626.0 5683.1 5693.1 5709.1 5757.6 5375.6 6198.3 6209.7 6213.3 6231.3 5161.5 5533.5 5549.9 5700.4 5716.6 5181.4 5266.5 5306.8 5313.7 5317.0 6262.2 6278.2 6294.5 6313.0 6331.9 6221.0 6229.7 6235.4 6237.5 6245.1 5205.9 6115.3 6212.8 6241.6 6281.2 6106.4 6142.5 6144.8 6148.7 6156.5 6186.7 6196.6 6198.5 6199.7 6218.8 5822.9 5886.4 5905.3 5992.6 5995.8 5212.3 5883.6 5977.6 6000.4 6046.3 5810.0 5818.2 5819.0 5829.0 5831.2 5435.3 5808.6 5851.1 5942.5 6019.5 5149.5 5743.3 5783.3 5808.3 5814.5 02:31:11 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | [#1] ext.html Cycles:180 Average:52774.72 Median:18613.62 stddev:106099.61 (570.0%) stddev-sans-first:106324.56 02:31:11 INFO - PROCESS | 1665 | Values: 467.5 489.8 523.6 528.2 552.7 28340.0 39859.8 40495.2 40579.8 40742.0 34820.5 42140.6 42419.9 42521.6 42735.9 8647.1 9410.9 9810.3 9812.9 9814.2 8761.6 11870.8 12104.2 12115.7 12230.6 11572.9 11604.9 11772.0 11867.1 12009.0 11748.7 11819.4 11827.5 11876.5 11909.9 11713.6 11792.5 11799.9 11806.0 11810.8 40104.8 40215.8 40399.6 40411.0 40422.6 3263.7 3303.5 3354.1 3476.1 3503.6 24624.6 24643.9 29667.0 31190.8 31321.7 2661.6 3167.0 3203.5 3218.3 3296.2 379912.0 382320.0 383453.0 385475.2 385574.1 55059.4 55089.9 55118.7 55186.0 55208.0 33873.2 34084.7 34350.3 58802.7 59075.1 15763.8 16144.6 16151.6 16167.4 16200.6 11386.3 11618.4 11642.0 12476.8 12572.3 16432.1 16499.7 16554.6 18333.4 18715.1 6988.8 7781.6 7837.5 8015.9 8018.3 823.8 882.3 961.2 1004.9 1022.6 25412.2 25553.7 29033.0 29597.3 30099.5 833.9 929.2 998.7 1077.9 1106.2 13017.7 14862.3 15443.8 15475.6 15877.7 192548.0 192601.0 192895.0 193476.0 194024.0 56231.7 56614.0 56751.7 56784.7 56920.7 1221.6 1251.6 1332.5 1356.3 1359.9 26429.9 27220.6 29129.7 30282.2 30743.0 46930.0 47306.3 47375.8 47424.0 47441.8 536794.0 538646.0 539209.0 539916.0 542095.3 25559.7 26304.2 26659.5 26744.0 27872.4 36769.0 46246.8 46958.0 47024.8 47236.1 37904.8 38148.4 38526.0 38791.0 39020.8 37500.6 37597.4 37684.8 38415.0 38823.8 37558.2 37926.8 37958.2 38237.8 38805.2 27926.6 28190.6 30715.0 32491.2 34473.0 25076.2 25162.1 25209.2 25504.1 26042.7 02:31:11 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | [#2] jquery.html Cycles:180 Average:34388.04 Median:11992.67 stddev:96822.49 (807.3%) stddev-sans-first:97060.37 02:31:11 INFO - PROCESS | 1665 | Values: 345.7 365.5 373.5 374.4 402.4 15092.5 15234.0 16506.7 20763.4 21356.0 19817.0 20721.0 21333.6 21466.9 21733.0 4479.7 5915.9 6166.6 6175.3 6178.5 6702.8 6866.7 6917.2 6927.2 6946.6 6634.0 6756.0 6757.9 6764.9 6850.7 6502.4 6764.1 6810.7 6812.9 6824.6 5817.5 5897.6 5898.9 5908.2 5908.9 25726.6 25969.5 25984.6 26118.0 26516.2 2252.3 2561.3 2669.5 2800.3 2836.8 15854.6 15900.0 16101.4 16234.1 16547.3 1886.7 1914.8 1920.8 1960.3 1966.8 110118.0 114456.0 117809.0 118439.4 118524.0 10933.6 10959.5 11026.1 11043.3 11406.2 14064.4 14073.2 14077.6 14079.0 14105.9 8524.3 8691.3 8710.5 8735.4 8878.9 8660.5 8682.5 8694.5 8818.5 8870.0 5967.4 6644.0 6729.9 6801.5 6854.2 1746.4 1827.5 1834.5 1837.6 1838.8 871.0 882.2 1032.8 1035.8 1043.1 19679.6 21174.4 22521.5 23033.4 23072.2 767.3 933.5 937.8 991.3 1021.5 11507.0 11917.6 12126.3 12153.5 12215.5 574198.0 577785.0 577954.0 587712.0 592171.2 116767.0 116836.4 116841.2 119512.4 124365.8 1001.2 1044.5 1069.0 1072.5 1073.6 15603.9 20174.6 20295.5 20334.1 20400.7 51289.2 51947.7 53522.0 53556.8 53683.2 57887.4 66427.0 73473.0 73818.5 74051.9 6103.9 7276.9 7453.0 7591.3 7727.3 10299.4 13362.0 13398.5 13883.0 13965.7 11414.9 11684.5 11929.9 11958.5 11999.2 11219.3 11264.3 11346.1 11461.3 11883.9 11669.5 11722.6 11941.3 11962.5 11995.3 5416.4 7472.4 7524.5 7556.0 7813.1 11255.3 11612.4 11755.9 11941.1 11943.5 02:31:11 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | [#3] mootools.html Cycles:180 Average:5718.34 Median:4982.53 stddev:3224.12 (64.7%) stddev-sans-first:3216.61 02:31:11 INFO - PROCESS | 1665 | Values: 1371.9 1502.1 1557.6 1774.2 1941.1 7923.2 8397.7 8766.6 9033.8 9059.8 7529.5 8986.8 8993.3 9003.0 9005.1 2408.5 2430.7 2434.5 2437.8 2438.2 2364.2 2414.6 2419.7 2420.0 2431.0 2056.5 2379.7 2399.0 2408.7 2420.3 2368.6 2386.3 2389.8 2397.1 2409.9 2352.9 2373.2 2373.3 2377.9 2382.5 8932.4 8937.0 9005.0 9036.1 9053.6 5201.7 5258.4 5403.7 5427.3 5437.5 3395.5 3518.0 3591.9 3601.6 3605.2 1046.6 1050.5 1067.9 1071.9 1080.7 11212.2 11505.4 11653.5 11791.6 11839.3 3864.7 4534.0 4584.4 4628.7 4663.1 9207.7 9208.0 9214.7 9225.7 9229.0 5149.6 5242.4 5246.1 5246.3 5248.0 3730.9 4135.8 4397.2 4559.4 4915.1 3753.7 3797.2 3806.6 3846.4 3853.6 1159.8 1166.2 1166.7 1178.1 1178.7 847.8 870.3 898.8 915.8 939.6 5776.2 5824.9 6060.0 6102.5 6237.4 721.5 911.4 963.1 989.0 1018.2 3805.6 3969.8 3981.9 4087.5 4105.7 10498.3 10748.3 10861.4 10867.0 10884.8 10818.4 10826.1 10834.4 10845.8 10861.7 8226.4 8313.0 8345.9 8351.2 8359.5 5731.7 5745.8 5785.5 6074.8 6087.3 9953.1 10069.4 10298.9 10319.6 10350.5 10389.6 10427.8 10520.8 10522.7 10578.0 6647.9 6826.3 6827.8 6873.2 6881.0 8307.9 8451.8 8535.8 8590.3 8717.0 7549.8 7581.4 7594.5 7631.9 7711.6 7388.9 7502.6 7516.9 7532.1 7561.7 7070.6 7106.3 7185.8 7197.8 7204.1 4977.8 4987.3 5120.8 5151.5 5306.0 5033.4 5132.8 5165.7 5179.4 5343.2 02:31:11 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | [#4] prototype.html Cycles:180 Average:4438.48 Median:4959.80 stddev:1387.88 (28.0%) stddev-sans-first:1355.90 02:31:11 INFO - PROCESS | 1665 | Values: 261.5 293.9 301.6 306.3 309.9 5218.8 5249.3 5267.4 5269.8 5309.9 4391.8 4972.5 5017.2 5109.3 5302.4 4018.7 4046.4 4063.5 4064.9 4081.2 3330.8 3365.4 3937.1 4024.6 4058.8 3859.2 4016.8 4019.5 4042.5 4057.3 4008.6 4014.7 4029.0 4059.9 4066.6 2944.5 3325.5 3463.0 3522.9 3527.2 4566.5 5119.2 5138.2 5224.7 5232.8 4238.2 4245.5 4488.8 4511.7 4559.5 4866.7 5464.9 5480.2 5481.7 5483.7 2817.6 2965.7 3739.4 3746.5 3781.4 4821.6 5659.0 5736.2 5760.9 5770.7 3765.9 3772.4 3773.6 3781.9 3790.3 3599.6 3613.2 3830.8 3843.1 3862.7 4320.4 4475.6 4489.3 4499.9 4543.2 4300.5 4518.5 5439.2 5497.4 5536.8 1180.9 1240.7 1260.5 1312.5 1326.1 822.9 848.4 849.6 919.3 935.3 4616.8 4712.5 4940.7 5142.7 5256.0 4592.2 4990.3 5679.1 5683.9 5759.2 4569.3 4979.5 5202.2 5246.8 5250.2 2380.6 2976.6 2985.3 2998.6 3017.3 4673.4 5210.6 5238.4 5499.3 5791.9 4524.0 5864.5 5882.6 5933.0 5976.4 4377.4 5186.0 5713.0 5874.9 6083.7 4610.4 5728.3 5789.2 5791.9 5837.4 4950.9 5712.6 5751.8 5757.6 5758.4 4968.7 5914.4 5930.7 5964.5 6028.7 3117.0 3186.0 3421.4 3609.0 3803.9 5650.9 5658.9 5664.5 5670.0 5729.3 4598.0 4751.0 5511.6 5541.2 5570.7 5280.4 5305.9 5374.4 5474.4 5587.8 4536.3 5505.5 5507.2 5510.5 5571.7 4642.2 5178.4 5404.3 5433.7 5525.6 4724.4 5519.0 5544.6 5556.8 5573.7 02:31:11 INFO - PROCESS | 1665 | 02:31:11 INFO - PROCESS | 1665 | [#5] yui.html Cycles:180 Average:23412.07 Median:4080.20 stddev:37229.08 (912.4%) stddev-sans-first:37294.33 02:31:11 INFO - PROCESS | 1665 | Values: 659.8 711.9 739.9 765.1 803.6 15066.2 15760.8 15841.0 15845.0 15859.6 14058.7 14170.3 14177.0 14177.1 14210.5 665.9 696.8 826.7 836.6 866.6 850.9 859.9 860.4 861.1 864.5 906.9 909.3 909.6 911.3 911.4 712.8 732.9 863.5 905.5 905.5 654.1 664.2 664.7 665.1 667.2 14936.3 15064.0 15094.7 15118.4 15183.9 13516.8 13634.9 13737.4 13850.4 13915.5 12279.8 12333.8 12390.3 12406.8 12741.6 4229.9 4425.2 4572.7 4589.7 4623.3 112947.0 116972.0 118930.4 120769.0 121775.0 10403.4 10948.4 10964.8 10992.5 11362.8 19915.5 20866.0 20870.5 21442.5 21487.8 8048.0 8096.0 8122.0 8137.7 8282.8 4418.4 4476.5 4510.0 4669.9 4678.4 3639.6 3782.0 3782.8 3783.4 3784.0 654.0 675.6 690.8 696.3 699.6 535.0 583.5 592.8 638.4 681.3 7875.8 9019.5 9577.5 9655.5 9762.9 535.3 589.2 603.6 673.7 674.5 3930.5 4377.8 4807.2 4834.2 4838.6 91969.0 105788.0 148112.0 151983.0 154105.0 77301.6 124802.4 128791.0 128928.0 129655.7 60071.7 99872.0 100258.5 107947.4 110104.4 9105.8 9111.0 9131.7 9143.5 9192.5 46543.3 50462.0 54681.5 58229.4 60329.7 64112.0 92693.0 94156.5 95533.0 96539.5 11472.1 11755.9 11912.0 12174.0 12187.8 10763.4 12871.1 12925.5 13280.3 13365.8 11923.4 12247.1 12483.3 12520.1 12654.2 11789.9 11866.7 11898.1 11952.8 12482.6 13179.3 13681.5 13945.5 14033.0 14039.9 11276.1 11290.7 11359.6 11552.8 11685.4 9211.8 10359.3 10402.2 10725.5 11523.5 02:31:11 INFO - PROCESS | 1665 | -------- Summary: end -------- 02:31:11 INFO - PROCESS | 1665 | 02:31:12 INFO - TEST-INFO | 1665: exit 0 02:31:12 INFO - TEST-OK | dromaeo_css | took 1118287ms 02:31:12 INFO - TEST-START | kraken 02:31:12 INFO - operating with platform_type : mac_ 02:31:12 INFO - Initialising browser for kraken test... 02:31:12 INFO - TEST-INFO | started process 1671 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/tmpoSZZly/profile http://localhost:49274/getInfo.html) 02:31:15 INFO - PROCESS | 1671 | __metrics Screen width/height:1600/1200 02:31:15 INFO - PROCESS | 1671 | colorDepth:24 02:31:15 INFO - PROCESS | 1671 | Browser inner width/height: 1024/689 02:31:15 INFO - PROCESS | 1671 | __metrics 02:31:15 INFO - PROCESS | 1671 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 02:31:15 INFO - PROCESS | 1671 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 02:31:15 INFO - TEST-INFO | 1671: exit 0 02:31:15 INFO - Browser initialized. 02:31:15 INFO - Running cycle 1/1 for kraken test... 02:31:15 INFO - TEST-INFO | started process 1672 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/T/tmpoSZZly/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:31:27 INFO - PROCESS | 1672 | RSS: Main: 235544576 02:31:27 INFO - PROCESS | 1672 | 02:31:30 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-beat-detection) 02:31:31 INFO - PROCESS | 1672 | RSS: Main: 294031360 02:31:31 INFO - PROCESS | 1672 | 02:31:34 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-dft) 02:31:34 INFO - PROCESS | 1672 | RSS: Main: 293175296 02:31:34 INFO - PROCESS | 1672 | 02:31:38 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-fft) 02:31:38 INFO - PROCESS | 1672 | RSS: Main: 384016384 02:31:38 INFO - PROCESS | 1672 | 02:31:41 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49274/tests/kraken/driver.html?testName=audio-oscillator) 02:31:41 INFO - PROCESS | 1672 | RSS: Main: 287195136 02:31:41 INFO - PROCESS | 1672 | 02:31:43 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-gaussian-blur) 02:31:44 INFO - PROCESS | 1672 | RSS: Main: 289726464 02:31:44 INFO - PROCESS | 1672 | 02:31:46 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-darkroom) 02:31:47 INFO - PROCESS | 1672 | RSS: Main: 328462336 02:31:47 INFO - PROCESS | 1672 | 02:31:50 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49274/tests/kraken/driver.html?testName=imaging-desaturate) 02:31:51 INFO - PROCESS | 1672 | RSS: Main: 328933376 02:31:51 INFO - PROCESS | 1672 | 02:31:53 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49274/tests/kraken/driver.html?testName=json-parse-financial) 02:31:54 INFO - PROCESS | 1672 | RSS: Main: 326868992 02:31:54 INFO - PROCESS | 1672 | 02:31:55 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49274/tests/kraken/driver.html?testName=json-stringify-tinderbox) 02:31:56 INFO - PROCESS | 1672 | RSS: Main: 300417024 02:31:56 INFO - PROCESS | 1672 | 02:31:58 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-aes) 02:31:59 INFO - PROCESS | 1672 | RSS: Main: 305737728 02:31:59 INFO - PROCESS | 1672 | 02:32:01 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-ccm) 02:32:02 INFO - PROCESS | 1672 | RSS: Main: 307888128 02:32:02 INFO - PROCESS | 1672 | 02:32:05 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 02:32:05 INFO - PROCESS | 1672 | RSS: Main: 316370944 02:32:05 INFO - PROCESS | 1672 | 02:32:08 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 02:32:09 INFO - PROCESS | 1672 | RSS: Main: 318517248 02:32:09 INFO - PROCESS | 1672 | 02:32:10 INFO - PROCESS | 1672 | Cycle 1(1): loaded http://localhost:49274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49274/tests/kraken/driver.html?testName=ai-astar) 02:32:11 INFO - PROCESS | 1672 | RSS: Main: 361951232 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | __start_tp_report 02:32:11 INFO - PROCESS | 1672 | _x_x_mozilla_page_load 02:32:11 INFO - PROCESS | 1672 | _x_x_mozilla_page_load_details 02:32:11 INFO - PROCESS | 1672 | |i|pagename|runs| 02:32:11 INFO - PROCESS | 1672 | |0;ai-astar;114;113;113;113;112;116;132;114;113;113 02:32:11 INFO - PROCESS | 1672 | |1;audio-beat-detection;144;114;132;178;107;111;109;107;143;143 02:32:11 INFO - PROCESS | 1672 | |2;audio-dft;182;183;185;184;184;184;177;181;182;183 02:32:11 INFO - PROCESS | 1672 | |3;audio-fft;82;62;75;116;86;65;60;59;83;63 02:32:11 INFO - PROCESS | 1672 | |4;audio-oscillator;89;71;92;72;81;80;92;68;70;90 02:32:11 INFO - PROCESS | 1672 | |5;imaging-gaussian-blur;89;85;89;86;89;86;89;87;89;86 02:32:11 INFO - PROCESS | 1672 | |6;imaging-darkroom;94;102;95;94;94;95;94;94;94;93 02:32:11 INFO - PROCESS | 1672 | |7;imaging-desaturate;85;83;84;86;84;83;83;82;86;84 02:32:11 INFO - PROCESS | 1672 | |8;json-parse-financial;56;53;52;51;53;55;53;52;53;55 02:32:11 INFO - PROCESS | 1672 | |9;json-stringify-tinderbox;71;69;80;71;71;69;70;70;69;62 02:32:11 INFO - PROCESS | 1672 | |10;stanford-crypto-aes;101;105;93;88;87;85;88;84;86;90 02:32:11 INFO - PROCESS | 1672 | |11;stanford-crypto-ccm;149;139;146;149;153;131;140;148;200;139 02:32:11 INFO - PROCESS | 1672 | |12;stanford-crypto-pbkdf2;167;168;170;169;168;168;168;167;166;168 02:32:11 INFO - PROCESS | 1672 | |13;stanford-crypto-sha256-iterative;67;68;68;68;68;69;67;65;66;69 02:32:11 INFO - PROCESS | 1672 | __end_tp_report 02:32:11 INFO - PROCESS | 1672 | __start_cc_report 02:32:11 INFO - PROCESS | 1672 | _x_x_mozilla_cycle_collect,2036 02:32:11 INFO - PROCESS | 1672 | __end_cc_report 02:32:11 INFO - PROCESS | 1672 | __startTimestamp1475055131187__endTimestamp 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | ------- Summary: start ------- 02:32:11 INFO - PROCESS | 1672 | Number of tests: 14 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#0] ai-astar Cycles:10 Average:115.30 Median:113.50 stddev:5.96 (5.3%) stddev-sans-first:6.31 02:32:11 INFO - PROCESS | 1672 | Values: 114.0 113.0 113.0 113.0 112.0 116.0 132.0 114.0 113.0 113.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#1] audio-beat-detection Cycles:10 Average:128.80 Median:137.50 stddev:23.44 (17.0%) stddev-sans-first:24.20 02:32:11 INFO - PROCESS | 1672 | Values: 144.0 114.0 132.0 178.0 107.0 111.0 109.0 107.0 143.0 143.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#2] audio-dft Cycles:10 Average:182.50 Median:183.50 stddev:2.27 (1.2%) stddev-sans-first:2.40 02:32:11 INFO - PROCESS | 1672 | Values: 182.0 183.0 185.0 184.0 184.0 184.0 177.0 181.0 182.0 183.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#3] audio-fft Cycles:10 Average:75.10 Median:70.00 stddev:17.67 (25.2%) stddev-sans-first:18.56 02:32:11 INFO - PROCESS | 1672 | Values: 82.0 62.0 75.0 116.0 86.0 65.0 60.0 59.0 83.0 63.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#4] audio-oscillator Cycles:10 Average:80.50 Median:85.00 stddev:9.76 (11.5%) stddev-sans-first:9.85 02:32:11 INFO - PROCESS | 1672 | Values: 89.0 71.0 92.0 72.0 81.0 80.0 92.0 68.0 70.0 90.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#5] imaging-gaussian-blur Cycles:10 Average:87.50 Median:89.00 stddev:1.65 (1.9%) stddev-sans-first:1.66 02:32:11 INFO - PROCESS | 1672 | Values: 89.0 85.0 89.0 86.0 89.0 86.0 89.0 87.0 89.0 86.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#6] imaging-darkroom Cycles:10 Average:94.90 Median:94.00 stddev:2.56 (2.7%) stddev-sans-first:2.69 02:32:11 INFO - PROCESS | 1672 | Values: 94.0 102.0 95.0 94.0 94.0 95.0 94.0 94.0 94.0 93.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#7] imaging-desaturate Cycles:10 Average:84.00 Median:84.00 stddev:1.33 (1.6%) stddev-sans-first:1.36 02:32:11 INFO - PROCESS | 1672 | Values: 85.0 83.0 84.0 86.0 84.0 83.0 83.0 82.0 86.0 84.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#8] json-parse-financial Cycles:10 Average:53.30 Median:53.00 stddev:1.57 (3.0%) stddev-sans-first:1.32 02:32:11 INFO - PROCESS | 1672 | Values: 56.0 53.0 52.0 51.0 53.0 55.0 53.0 52.0 53.0 55.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#9] json-stringify-tinderbox Cycles:10 Average:70.20 Median:70.50 stddev:4.34 (6.2%) stddev-sans-first:4.59 02:32:11 INFO - PROCESS | 1672 | Values: 71.0 69.0 80.0 71.0 71.0 69.0 70.0 70.0 69.0 62.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#10] stanford-crypto-aes Cycles:10 Average:90.70 Median:87.50 stddev:7.02 (8.0%) stddev-sans-first:6.39 02:32:11 INFO - PROCESS | 1672 | Values: 101.0 105.0 93.0 88.0 87.0 85.0 88.0 84.0 86.0 90.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#11] stanford-crypto-ccm Cycles:10 Average:149.40 Median:148.50 stddev:18.95 (12.8%) stddev-sans-first:20.09 02:32:11 INFO - PROCESS | 1672 | Values: 149.0 139.0 146.0 149.0 153.0 131.0 140.0 148.0 200.0 139.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.90 Median:168.00 stddev:1.10 (0.7%) stddev-sans-first:1.12 02:32:11 INFO - PROCESS | 1672 | Values: 167.0 168.0 170.0 169.0 168.0 168.0 168.0 167.0 166.0 168.0 02:32:11 INFO - PROCESS | 1672 | 02:32:11 INFO - PROCESS | 1672 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.50 Median:68.00 stddev:1.27 (1.9%) stddev-sans-first:1.33 02:32:11 INFO - PROCESS | 1672 | Values: 67.0 68.0 68.0 68.0 68.0 69.0 67.0 65.0 66.0 69.0 02:32:11 INFO - PROCESS | 1672 | -------- Summary: end -------- 02:32:11 INFO - PROCESS | 1672 | 02:32:12 INFO - TEST-INFO | 1672: exit 0 02:32:12 INFO - TEST-OK | kraken | took 59377ms 02:32:12 INFO - SUITE-END | took 1177s 02:32:12 INFO - Completed test suite (00:19:37) 02:32:12 INFO - javascript benchmark 02:32:12 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2747.9862600686993, 3291.42400079986, 3304.438245498265, 3372.443546814776, 3381.56039714837, 5438.700871452069, 5566.248556444879, 5596.9160462593045, 5642.746076426561, 5647.29408823897, 5546.473085056913, 5561.388247292804, 5672.262605861242, 5676.347220069693, 5703.03048481757, 5075.7715902784275, 5088.745562721868, 5112.130937740574, 5163.1480805667015, 5171.3535808024, 5098.362704661918, 5105.770240339175, 5106.5659418949435, 5148.0, 5172.715500647463, 5042.647014708972, 5062.417821950449, 5097.821576244833, 5115.386153661547, 5127.9230811537855, 4870.366852309213, 4990.652523818585, 5021.59827213822, 5110.10573149701, 5142.845714628567, 5058.494150584949, 5099.974500127512, 5129.717865517395, 5133.486651334874, 5140.871478213075, 5504.091824848895, 5549.750261238254, 5581.49766521015, 5584.246126772874, 5586.525145362649, 6059.697015149269, 6066.545009124289, 6080.0575910733905, 6144.678894037758, 6160.907586386208, 6179.351168127327, 6190.628562286277, 6218.81343559694, 6240.875182496325, 6250.468710159642, 5565.193047008162, 5617.943820561783, 5687.43125687428, 5694.9430505695245, 5726.055200891807, 6153.600015999035, 6183.072539119168, 6194.845128871814, 6246.625202487774, 6260.530460215502, 6007.128966299862, 6018.307894592091, 6022.967422943478, 6027.306859711101, 6091.878162436727, 6152.876942461216, 6191.473724733448, 6191.597546159485, 6203.7828675996125, 6211.09939058834, 5886.558508111909, 5919.792807251725, 5920.79277225295, 6027.819165425044, 6089.147519347295, 6123.496151642696, 6134.209553866654, 6134.423542112324, 6141.942449279452, 6151.72317245725, 4740.810367585258, 4818.180909245437, 4852.199387101159, 4877.756112194376, 4900.117978763786, 4350.477942646839, 4356.651467882625, 4375.47494300686, 4401.163778882066, 4413.867583972486, 5626.0, 5683.090705487102, 5693.060644993612, 5709.086546152679, 5757.596968212185, 5375.569954403638, 6198.287196972406, 6209.65846878417, 6213.254409470893, 6231.283402408781, 5161.458046905096, 5533.474319939599, 5549.889002219933, 5700.37295897451, 5716.599838011382, 5181.35233095863, 5266.47335266478, 5306.7611957462, 5313.654612450256, 5317.042932272151, 6262.248530176317, 6278.246610406781, 6294.527910406646, 6312.968435157978, 6331.873362532816, 6220.968895155495, 6229.657368844757, 6235.407636274546, 6237.4698150657705, 6245.125682404558, 5205.869853253699, 6115.270764408881, 6212.844678883064, 6241.594296370721, 6281.246250449975, 6106.36966090081, 6142.508599312134, 6144.846378840565, 6148.723307451265, 6156.538259630456, 6186.721597528032, 6196.566240363131, 6198.504119670506, 6199.721012554356, 6218.751249949952, 5822.912656310244, 5886.440788125121, 5905.291365036223, 5992.610480318765, 5995.790147344822, 5212.322398088224, 5883.61756485827, 5977.641341519523, 6000.429959154048, 6046.27444706638, 5810.0, 5818.185454036523, 5819.0, 5829.0, 5831.212786273799, 5435.2934118564335, 5808.593398462236, 5851.1223316502865, 5942.524598032233, 6019.4883434908525, 5149.459306772885, 5743.310802703702, 5783.334916484658, 5808.332041815076, 5814.476697097112], "value": 5583.549230017431, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [467.54180902715336, 489.7967343552425, 523.5628250410907, 528.207688467299, 552.682207730555, 28339.999999999975, 39859.80070099649, 40495.19009619806, 40579.79710101453, 40742.0, 34820.477692834625, 42140.57859421405, 42419.939501512476, 42521.574784252145, 42735.93160170997, 8647.135286471366, 9410.858837117448, 9810.313278070538, 9812.852807207897, 9814.165795907356, 8761.56192190391, 11870.821937670942, 12104.152709310309, 12115.697107572292, 12230.571929982452, 11572.942135289311, 11604.883951160507, 11772.0, 11867.109966752485, 12009.039276857875, 11748.706282342968, 11819.409029548488, 11827.526898924032, 11876.52493900243, 11909.94045029778, 11713.590024349107, 11792.469338879771, 11799.941000294944, 11806.0, 11810.763784724257, 40104.79947600273, 40215.79892100521, 40399.59600403988, 40411.0, 40422.59577404218, 3263.7225835803984, 3303.4714445688574, 3354.077628652116, 3476.1483436558206, 3503.649635036476, 24624.630630540556, 24643.87678061598, 29667.0, 31190.844045779624, 31321.686783132103, 2661.614065960425, 3167.010799328559, 3203.5194720791833, 3218.2758879251983, 3296.1924328539662, 379912.0, 382319.9999999972, 383453.0, 385475.21787172934, 385574.0721296404, 55059.44940550623, 55089.898202035736, 55118.72440637771, 55186.0, 55208.0, 33873.15317117092, 34084.65915340865, 34350.312993739986, 58802.705986469795, 59075.113873291935, 15763.842361576237, 16144.596385090466, 16151.596210094607, 16167.434139805051, 16200.594985125466, 11386.316820990767, 11618.360990145624, 11641.952224299854, 12476.75046499065, 12572.308523031139, 16432.096234707205, 16499.6700065998, 16554.58613534671, 18333.449996500127, 18715.064246787606, 6988.825279368057, 7781.638213312761, 7837.451378403457, 8015.919840801517, 8018.278354948083, 823.798169448477, 882.289756745813, 961.1925982174866, 1004.9246306526893, 1022.6216299969059, 25412.221144519706, 25553.744462555507, 29033.0, 29597.26006849846, 30099.548506772415, 833.8582440984926, 929.1962452478692, 998.6654470752234, 1077.9411324370415, 1106.2311693373028, 13017.739645207042, 14862.331195096247, 15443.830165855155, 15475.613109672124, 15877.682446351007, 192548.0, 192601.0, 192895.0, 193476.0, 194024.0, 56231.718841405534, 56614.0, 56751.71624141935, 56784.716076420176, 56920.715396422755, 1221.62740364188, 1251.5682089679228, 1332.47367289918, 1356.328617334406, 1359.8708122728326, 26429.942802287693, 27220.591691125046, 29129.708702913547, 30282.242943925696, 30743.0, 46930.0, 47306.29040564463, 47375.76312118417, 47424.0, 47441.81395465141, 536794.0, 538646.0, 539209.0, 539916.0, 542095.2895235498, 25559.744402555738, 26304.21087367382, 26659.466810664067, 26744.0, 27872.44255114927, 36769.0, 46246.768766155954, 46958.0, 47024.7648761754, 47236.05527889491, 37904.810475947445, 38148.42777358397, 38526.03684907788, 38791.0, 39020.804895975336, 37500.62499374971, 37597.43603845999, 37684.811575941945, 38415.0, 38823.805880970416, 37558.2488350226, 37926.810365948, 37958.24083518369, 38237.808810955765, 38805.2238955225, 27926.60366981602, 28190.577141343307, 30715.0, 32491.187720306236, 34473.0, 25076.247712568653, 25162.112841536593, 25209.24372268835, 25504.107356242443, 26042.73957260403], "value": 18878.928785133827, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [345.67506543848793, 365.5430711610487, 373.46967306424864, 374.3542389378323, 402.41046866340804, 15092.47176348828, 15233.999999999985, 16506.669866602675, 20763.377098687026, 21356.03897824598, 19817.0, 20721.0, 21333.573328533457, 21466.89266553669, 21733.0, 4479.708818926776, 5915.852103697421, 6166.568340216187, 6175.289841668198, 6178.536609754264, 6702.7654032108885, 6866.690998905061, 6917.204521480044, 6927.168739751211, 6946.583205007691, 6634.038064480647, 6756.0, 6757.864842703168, 6764.898526522106, 6850.657467126649, 6502.382273684039, 6764.120664313657, 6810.693518791617, 6812.931870681304, 6824.624645644488, 5817.476427121579, 5897.557683173736, 5898.941010589882, 5908.202392676976, 5908.852278693024, 25726.6141007885, 25969.480610387876, 25984.610230846552, 26117.955281788705, 26516.20451386442, 2252.3468194223656, 2561.2828408045775, 2669.466106778652, 2800.2999250187454, 2836.82271857179, 15854.603634909105, 15900.0, 16101.389861013922, 16234.10712410817, 16547.255373508102, 1886.7169924511434, 1914.7702275726863, 1920.807919208068, 1960.2942940541393, 1966.783653798081, 110118.0, 114456.0, 117809.0, 118439.4078029613, 118524.0, 10933.617323393642, 10959.452027398758, 11026.117910567136, 11043.282186657842, 11406.201565890307, 14064.367103480368, 14073.225972571607, 14077.606806842861, 14079.014468987072, 14105.858941410455, 8524.275436587835, 8691.304695624334, 8710.477371357612, 8735.388522803343, 8878.86681699775, 8660.523671198018, 8682.52246126469, 8694.521801300863, 8818.51498167607, 8869.955650221707, 5967.433093856077, 6644.003399490115, 6729.932700673028, 6801.4558835293055, 6854.2117656469145, 1746.449868291484, 1827.4883032750852, 1834.5415394761196, 1837.6232872261155, 1838.8436982856606, 871.0375035585713, 882.2016075451727, 1032.8380571856662, 1035.8498017787379, 1043.0977204718015, 19679.60640787176, 21174.364769056952, 22521.549569008526, 23033.424164396023, 23072.192473263356, 767.2902565127235, 933.4912472702393, 937.7983733497331, 991.3407583956588, 1021.4790456867051, 11507.02190313816, 11917.642470725892, 12126.27242365461, 12153.453094610764, 12215.511379544896, 574198.0, 577785.0, 577954.0, 587712.0, 592171.2348629548, 116767.0, 116836.41581792207, 116841.22726841303, 119512.40243798726, 124365.75634243722, 1001.1890368801148, 1044.4568824211367, 1069.0, 1072.5066469424153, 1073.6242315189777, 15603.92198039048, 20174.58777885534, 20295.46306711661, 20334.084966176262, 20400.693989590465, 51289.15331350089, 51947.74026129845, 53522.0, 53556.79739082052, 53683.19475207797, 57887.421125788205, 66427.00718978439, 73473.0, 73818.52362952818, 74051.88922166065, 6103.938960610337, 7276.854462910818, 7452.962735186289, 7591.278828511283, 7727.343175829893, 10299.3820370778, 13362.0, 13398.464061437433, 13883.0, 13965.720685586435, 11414.942925285653, 11684.47419866125, 11929.940350298193, 11958.46186921608, 11999.220050696676, 11219.326840389276, 11264.324140551593, 11346.149038821955, 11461.338105974753, 11883.881161188277, 11669.474873630537, 11722.608457302404, 11941.343226122646, 11962.521499139937, 11995.340256285988, 5416.404195538409, 7472.40220782347, 7524.473286869867, 7555.962220188864, 7813.1405545388825, 11255.324680519196, 11612.419379030845, 11755.9138284938, 11941.104417168921, 11943.522259109539], "value": 9939.799047203449, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1371.938262778175, 1502.1437780465135, 1557.6417423992482, 1774.1661419133004, 1941.1264930781151, 7923.168067352932, 8397.664093436262, 8766.605502752383, 9033.819323613523, 9059.818803623924, 7529.47293689442, 8986.775330616721, 8993.280537556997, 9003.0, 9005.099490050992, 2408.5182963407347, 2430.6718592989987, 2434.5374378868046, 2437.7805997460223, 2438.244144315268, 2364.219807463533, 2414.553307638084, 2419.697537807774, 2420.044082587377, 2431.0397393029743, 2056.475598722324, 2379.7263314718857, 2398.95202095958, 2408.650745641881, 2420.298113547069, 2368.561816064034, 2386.2721869829693, 2389.82076344274, 2397.137030668958, 2409.903603855844, 2352.929412117639, 2373.169390713254, 2373.299876536426, 2377.91677291294, 2382.5234953009467, 8932.419392739515, 8936.955315223382, 9004.954975225148, 9036.096390360977, 9053.637854485813, 5201.739913004335, 5258.3689957205, 5403.675779453245, 5427.3215848019, 5437.537809286216, 3395.47370157626, 3517.9648203517895, 3591.8742844000594, 3601.621829707869, 3605.170810713524, 1046.576136664652, 1050.453764042701, 1067.909227715645, 1071.9142468602492, 1080.6920027792041, 11212.159088068427, 11505.367204803733, 11653.53385864573, 11791.587294444738, 11839.348835814113, 3864.7101467390057, 4534.0478499515475, 4584.358189853423, 4628.722276663411, 4663.114008338405, 9207.723768286962, 9207.961372746977, 9214.723558293263, 9225.72322830316, 9229.0, 5149.562287205555, 5242.423333433319, 5246.0557099721655, 5246.291750613695, 5247.950409918031, 3730.850765969385, 4135.793210339471, 4397.2085024695225, 4559.361689363492, 4915.066137433876, 3753.718471114623, 3797.2025874566652, 3806.600306967784, 3846.3653497172654, 3853.5761066282685, 1159.837622732818, 1166.2477701882408, 1166.6849950513315, 1178.1222988873344, 1178.7347846734588, 847.8346722389075, 870.3124531619949, 898.81574277273, 915.7756349694367, 939.6006697153682, 5776.191333213354, 5824.883502330014, 6060.000099983454, 6102.481289090389, 6237.438630523275, 721.4985585018362, 911.4485736129546, 963.1235575626287, 988.9862890537113, 1018.1905385218769, 3805.6194380562274, 3969.801509924492, 3981.92036159281, 4087.529934057562, 4105.69207309447, 10498.317609355367, 10748.301360411548, 10861.40262285582, 10867.0, 10884.836727449094, 10818.404987725751, 10826.133909287395, 10834.404107774148, 10845.783084338269, 10861.728456788644, 8226.383021273428, 8312.960879890014, 8345.916540834514, 8351.248387645019, 8359.498430094214, 5731.7420716067045, 5745.770169193185, 5785.537157027512, 6074.757009719562, 6087.347142500624, 9953.054459826304, 10069.446180460145, 10298.948505257726, 10319.638812641522, 10350.53422596, 10389.636362727268, 10427.791444170922, 10520.842187367349, 10522.736931576772, 10578.0, 6647.933520664731, 6826.2832402599, 6827.829304267433, 6873.243943166348, 6880.965595171992, 8307.916920830714, 8451.788705282417, 8535.786605334917, 8590.312774977861, 8717.0, 7549.811254718676, 7581.393488521016, 7594.544327340377, 7631.885521717068, 7711.575863327571, 7388.926110738824, 7502.587357695161, 7516.887246691414, 7532.096148462219, 7561.659725312485, 7070.646467676493, 7106.324899134574, 7185.820354491179, 7197.784066478014, 7204.135503739585, 4977.800887964441, 4987.251912213052, 5120.820771272987, 5151.484851514819, 5306.0, 5033.395992480926, 5132.769025393941, 5165.66423182492, 5179.430262671179, 5343.225232341367], "value": 4581.929101791892, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [261.48617965697406, 293.86041630225634, 301.56725099482236, 306.3169132833781, 309.88844016154195, 5218.791248350066, 5249.291345668338, 5267.367915850104, 5269.8155564555245, 5309.920351194735, 4391.758453285076, 4972.477889821571, 5017.19724844025, 5109.335786347779, 5302.416734159239, 4018.6985976051915, 4046.3930410438525, 4063.4850854011215, 4064.878053658395, 4081.244969680611, 3330.81680507572, 3365.444701624229, 3937.1338305572726, 4024.557298697141, 4058.7970601469956, 3859.2281543691233, 4016.758994460342, 4019.5176578810438, 4042.4830397554024, 4057.3305404608204, 4008.6392224699916, 4014.698897582693, 4028.9798551007057, 4059.918801623966, 4066.573009833969, 2944.4847151748572, 3325.451300535409, 3463.0, 3522.947155792665, 3527.1887465882733, 4566.474855391639, 5119.206522988943, 5138.203578445347, 5224.712640804754, 5232.816851410221, 4238.152369526107, 4245.532991370947, 4488.842890498817, 4511.661625378109, 4559.475660299075, 4866.7079975201605, 5464.890702185974, 5480.21892884814, 5481.671099734029, 5483.725813709299, 2817.60553522507, 2965.733084022448, 3739.383001804699, 3746.4754934309217, 3781.3760729479604, 4821.614270858323, 5659.0, 5736.168255602956, 5760.855978600484, 5770.653760774367, 3765.9246815063543, 3772.4152756322815, 3773.6226377362595, 3781.9243615128094, 3790.2608991246443, 3599.5500562429697, 3613.223157021253, 3830.7701537907815, 3843.135294558758, 3862.6909847212155, 4320.395144679747, 4475.641948644101, 4489.349044388546, 4499.887502812456, 4543.227651299287, 4300.526942036374, 4518.480374756879, 5439.246919625525, 5497.39528651848, 5536.785285885598, 1180.86420061694, 1240.7270400511873, 1260.4895017517736, 1312.4553310376086, 1326.1313839434993, 822.8518866604069, 848.3849209323191, 849.6473963305283, 919.3013309884536, 935.270489018553, 4616.814398065324, 4712.481627021025, 4940.703557786473, 5142.6914385137015, 5255.973720131451, 4592.173408786383, 4990.276409920614, 5679.119736440858, 5683.914741278884, 5759.222504961776, 4569.2689169732685, 4979.502049794992, 5202.205239192473, 5246.7638956247065, 5250.212468129811, 2380.6429035644446, 2976.5535169724712, 2985.328301132228, 2998.6401631804324, 3017.336186039068, 4673.411040246333, 5210.557102646242, 5238.371395432497, 5499.340079190522, 5791.872388909941, 4524.0094358482165, 5864.530837532987, 5882.588218824641, 5932.970335148383, 5976.372480889531, 4377.365282034088, 5185.974070129625, 5712.999999999917, 5874.882502349929, 6083.695815209222, 4610.423697037871, 5728.341240757366, 5789.1605717171615, 5791.884162316815, 5837.445442682938, 4950.900981980269, 5712.571557133148, 5751.827445176651, 5757.5681823864215, 5758.445219790717, 4968.701877887338, 5914.408559144051, 5930.703464826655, 5964.522838172849, 6028.698565071817, 3117.0, 3186.0, 3421.4354631485526, 3608.963910360863, 3803.85884234734, 5650.915236271377, 5658.9151162733415, 5664.49019588239, 5670.0, 5729.28383952006, 4598.0, 4750.952490475189, 5511.58663100261, 5541.224228607917, 5570.749316280858, 5280.419153893145, 5305.867353316198, 5374.355077390738, 5474.397816240131, 5587.792821835434, 4536.274196128604, 5505.532029777353, 5507.201455788968, 5510.504054635102, 5571.721413929368, 4642.187617166915, 5178.43037265908, 5404.270423492778, 5433.728313584384, 5525.618595351162, 4724.385829842098, 5519.0, 5544.63959842609, 5556.805511807067, 5573.721313934206], "value": 3997.2266288449327, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [659.7657831469829, 711.8825393810022, 739.9334059934605, 765.135397001388, 803.6498682213878, 15066.246687665614, 15760.842391576081, 15840.970336928107, 15845.049297042186, 15859.603509912244, 14058.718825623482, 14170.29148542574, 14177.0, 14177.07848989815, 14210.502632407843, 665.8668266346726, 696.8257935516122, 826.6528058215533, 836.5900708652762, 866.5710473315718, 850.8681154421074, 859.9484030958131, 860.389123722158, 861.0657436681208, 864.4597126795753, 906.9455832650029, 909.3498148823589, 909.6452383570413, 911.2527727263647, 911.444019148319, 712.8324843661735, 732.9267073292681, 863.5121156546531, 905.4702998745742, 905.4793493741092, 654.1463390275688, 664.1963224498363, 664.6975626090117, 665.1253601514042, 667.1860330396908, 14936.32786524609, 15064.0, 15094.698106037928, 15118.39526418942, 15183.924080379638, 13516.797248041188, 13634.86365136346, 13737.381817818223, 13850.376733047036, 13915.512957046454, 12279.75440491194, 12333.753324933452, 12390.256584604953, 12406.75186496274, 12741.55404560836, 4229.851955181553, 4425.203463376591, 4572.673924561873, 4589.724616523019, 4623.260278355447, 112947.0, 116972.0, 118930.40534797357, 120769.0, 121775.0, 10403.432795885437, 10948.39783811882, 10964.780704385868, 10992.505337259843, 11362.772744545227, 19915.50275858647, 20866.0, 20870.478238043866, 21442.463938401354, 21487.785122148893, 8047.994000749906, 8096.0, 8122.0, 8137.674493020331, 8282.792930176794, 4418.425604671372, 4476.46282446102, 4510.0, 4669.906601868011, 4678.391809064799, 3639.563252409675, 3781.9977705907954, 3782.7730336179916, 3783.356829339019, 3783.981080094582, 653.9934600654028, 675.6115233740619, 690.8272931767058, 696.2967402923084, 699.597731304502, 534.9572034237252, 583.4515555377931, 592.8132638219033, 638.4030931079456, 681.2914568848441, 7875.842483150305, 9019.503927283931, 9577.521123943776, 9655.468949207861, 9762.902370976199, 535.2613393516922, 589.2310534752104, 603.6378173096195, 673.6631684157921, 674.5413119079074, 3930.5479869815335, 4377.78111094444, 4807.18277892759, 4834.178189707688, 4838.612910967114, 91969.0, 105788.0, 148112.0, 151983.0, 154105.0, 77301.61349193218, 124802.37598812129, 128791.0, 128928.0, 129655.70344296437, 60071.69964150151, 99872.0, 100258.46252293522, 107947.38078928822, 110104.4494777537, 9105.77235569116, 9111.043340449158, 9131.726048218565, 9143.497107659143, 9192.49441280736, 46543.301850471595, 50462.0, 54681.45318546764, 58229.4177058241, 60329.69835150796, 64112.0, 92693.0, 94156.52921735622, 95533.0, 96539.51730241303, 11472.082233421474, 11755.941220293844, 11912.0, 12174.0, 12187.817182742088, 10763.408012559072, 12871.099023068295, 12925.482980680668, 13280.335983200994, 13365.799513007507, 11923.403829808649, 12247.081468890046, 12483.31341776211, 12520.060995425198, 12654.240745555297, 11789.941050294694, 11866.703332416413, 11898.107641926717, 11952.820707689218, 12482.563110291096, 13179.275139867015, 13681.452741890213, 13945.511907083204, 14033.0, 14039.859601404263, 11276.097912167172, 11290.661280161608, 11359.608405772547, 11552.768944620891, 11685.415729213675, 9211.76970575741, 10359.32664376813, 10402.248061245504, 10725.479512314443, 11523.481443334902], "value": 7633.646480018803, "unit": "score"}], "name": "dromaeo_css", "value": 7260.642675246745, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 113.0, 113.0, 113.0, 112.0, 116.0, 132.0, 114.0, 113.0, 113.0], "value": 115.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 114.0, 132.0, 178.0, 107.0, 111.0, 109.0, 107.0, 143.0, 143.0], "value": 128.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [182.0, 183.0, 185.0, 184.0, 184.0, 184.0, 177.0, 181.0, 182.0, 183.0], "value": 182.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 62.0, 75.0, 116.0, 86.0, 65.0, 60.0, 59.0, 83.0, 63.0], "value": 75.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 71.0, 92.0, 72.0, 81.0, 80.0, 92.0, 68.0, 70.0, 90.0], "value": 80.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 85.0, 89.0, 86.0, 89.0, 86.0, 89.0, 87.0, 89.0, 86.0], "value": 87.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 102.0, 95.0, 94.0, 94.0, 95.0, 94.0, 94.0, 94.0, 93.0], "value": 94.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 83.0, 84.0, 86.0, 84.0, 83.0, 83.0, 82.0, 86.0, 84.0], "value": 84.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 53.0, 52.0, 51.0, 53.0, 55.0, 53.0, 52.0, 53.0, 55.0], "value": 53.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 69.0, 80.0, 71.0, 71.0, 69.0, 70.0, 70.0, 69.0, 62.0], "value": 70.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 105.0, 93.0, 88.0, 87.0, 85.0, 88.0, 84.0, 86.0, 90.0], "value": 90.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 139.0, 146.0, 149.0, 153.0, 131.0, 140.0, 148.0, 200.0, 139.0], "value": 149.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 168.0, 170.0, 169.0, 168.0, 168.0, 168.0, 167.0, 166.0, 168.0], "value": 167.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 68.0, 68.0, 68.0, 68.0, 69.0, 67.0, 65.0, 66.0, 69.0], "value": 67.5, "unit": "score"}], "name": "kraken", "value": 1447.6000000000001, "alertThreshold": 2.0}]} 02:32:12 INFO - Return code: 0 02:32:12 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 02:32:12 INFO - # TBPL SUCCESS # 02:32:12 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 02:32:12 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 02:32:12 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 02:32:12 INFO - 2016-09-28 02:32:12.509 screenresolution[1676:11690] starting screenresolution argv=screenresolution get 02:32:12 INFO - 2016-09-28 02:32:12.512 screenresolution[1676:11690] Display 0: 1600x1200x32@60 02:32:12 INFO - 2016-09-28 02:32:12.518 screenresolution[1677:11693] starting screenresolution argv=screenresolution list 02:32:12 INFO - Available Modes on Display 0 02:32:12 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 02:32:12 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 02:32:12 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 02:32:12 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 02:32:12 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 02:32:12 INFO - Intel Iris: 02:32:12 INFO - Chipset Model: Intel Iris 02:32:12 INFO - Type: GPU 02:32:12 INFO - Bus: Built-In 02:32:12 INFO - VRAM (Dynamic, Max): 1536 MB 02:32:12 INFO - Vendor: Intel (0x8086) 02:32:12 INFO - Device ID: 0x0a2e 02:32:12 INFO - Revision ID: 0x0009 02:32:12 INFO - Displays: 02:32:12 INFO - Display: 02:32:12 INFO - Resolution: 1600 x 1200 @ 60 Hz 02:32:12 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 02:32:12 INFO - Display Serial Number: 1600x1200 60 02:32:12 INFO - Main Display: Yes 02:32:12 INFO - Mirror: Off 02:32:12 INFO - Online: Yes 02:32:12 INFO - Rotation: Supported 02:32:12 INFO - Return code: 0 02:32:12 INFO - Running post-action listener: _resource_record_post_action 02:32:12 INFO - [mozharness: 2016-09-28 09:32:12.752368Z] Finished run-tests step (success) 02:32:12 INFO - Running post-run listener: _resource_record_post_run 02:32:12 INFO - Total resource usage - Wall time: 1213s; CPU: 53.0%; Read bytes: 31910912; Write bytes: 708095488; Read time: 196; Write time: 1966 02:32:12 INFO - TinderboxPrint: CPU usage
53.4% 02:32:12 INFO - TinderboxPrint: I/O read bytes / time
31,910,912 / 196 02:32:12 INFO - TinderboxPrint: I/O write bytes / time
708,095,488 / 1,966 02:32:12 INFO - TinderboxPrint: CPU idle
2,259.6 (46.6%) 02:32:12 INFO - TinderboxPrint: CPU system
975.8 (20.1%) 02:32:12 INFO - TinderboxPrint: CPU user
1,618.3 (33.3%) 02:32:12 INFO - TinderboxPrint: Swap in / out
434,823,168 / 0 02:32:12 INFO - install - Wall time: 35s; CPU: 54.0%; Read bytes: 397386240; Write bytes: 392214528; Read time: 29536; Write time: 783 02:32:12 INFO - run-tests - Wall time: 1179s; CPU: 53.0%; Read bytes: 30014464; Write bytes: 297076224; Read time: 181; Write time: 1136 02:32:13 INFO - Running post-run listener: _upload_blobber_files 02:32:13 INFO - Blob upload gear active. 02:32:13 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 02:32:13 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 02:32:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 02:32:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 02:32:13 INFO - (blobuploader) - INFO - Open directory for files ... 02:32:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 02:32:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:32:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:32:14 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 02:32:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:32:14 INFO - (blobuploader) - INFO - Done attempting. 02:32:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 02:32:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:32:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:32:15 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 02:32:15 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:32:15 INFO - (blobuploader) - INFO - Done attempting. 02:32:15 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 02:32:15 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:32:15 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:32:17 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 02:32:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:32:17 INFO - (blobuploader) - INFO - Done attempting. 02:32:17 INFO - (blobuploader) - INFO - Iteration through files over. 02:32:17 INFO - Return code: 0 02:32:17 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 02:32:17 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 02:32:17 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a6bc04f2b4319f2cd57a4e02d6fa6cf18b463d60c76eeec05f61ab754332237eb527ea58cdf40e02e3cc48c66e2ee8eacc0847b702875dd29bd9eff82ed31b8a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/e4645819743130afbfc86bc9f8953f1cf4a7ab3b5d37a16f7816f7a1eada3d2db6cb8ff2140b9dc45bff2901a49316320430c0fcb481d79510b1126b1955fd53", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0356a3635885929683882abef4804112ce0fb6623345a8f277958ef01719922bd83cb57ec0b812d0c639c20f7b15450c175f00e1541758c1fbe0e40ce479030e"} 02:32:17 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 02:32:17 INFO - Writing to file /builds/slave/test/properties/blobber_files 02:32:17 INFO - Contents: 02:32:17 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a6bc04f2b4319f2cd57a4e02d6fa6cf18b463d60c76eeec05f61ab754332237eb527ea58cdf40e02e3cc48c66e2ee8eacc0847b702875dd29bd9eff82ed31b8a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/e4645819743130afbfc86bc9f8953f1cf4a7ab3b5d37a16f7816f7a1eada3d2db6cb8ff2140b9dc45bff2901a49316320430c0fcb481d79510b1126b1955fd53", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0356a3635885929683882abef4804112ce0fb6623345a8f277958ef01719922bd83cb57ec0b812d0c639c20f7b15450c175f00e1541758c1fbe0e40ce479030e"} 02:32:17 INFO - Running post-run listener: copy_logs_to_upload_dir 02:32:17 INFO - Copying logs to upload dir... 02:32:17 INFO - mkdir: /builds/slave/test/build/upload/logs 02:32:17 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1273.239561 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 13 secs) (at 2016-09-28 02:32:17.821412) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-28 02:32:17.829313) ========= 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.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners TMPDIR=/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/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:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a6bc04f2b4319f2cd57a4e02d6fa6cf18b463d60c76eeec05f61ab754332237eb527ea58cdf40e02e3cc48c66e2ee8eacc0847b702875dd29bd9eff82ed31b8a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/e4645819743130afbfc86bc9f8953f1cf4a7ab3b5d37a16f7816f7a1eada3d2db6cb8ff2140b9dc45bff2901a49316320430c0fcb481d79510b1126b1955fd53", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0356a3635885929683882abef4804112ce0fb6623345a8f277958ef01719922bd83cb57ec0b812d0c639c20f7b15450c175f00e1541758c1fbe0e40ce479030e"} build_url:https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011225 build_url: 'https://queue.taskcluster.net/v1/task/ExeDO-68SWSaXcPmY2rxSg/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a6bc04f2b4319f2cd57a4e02d6fa6cf18b463d60c76eeec05f61ab754332237eb527ea58cdf40e02e3cc48c66e2ee8eacc0847b702875dd29bd9eff82ed31b8a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/e4645819743130afbfc86bc9f8953f1cf4a7ab3b5d37a16f7816f7a1eada3d2db6cb8ff2140b9dc45bff2901a49316320430c0fcb481d79510b1126b1955fd53", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0356a3635885929683882abef4804112ce0fb6623345a8f277958ef01719922bd83cb57ec0b812d0c639c20f7b15450c175f00e1541758c1fbe0e40ce479030e"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-28 02:32:17.864574) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-28 02:32:17.864873) ========= 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.ce3Q17BBZ9/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.0oCf1C1Y0R/Listeners TMPDIR=/var/folders/m8/xm1_j30s6pvgt5d6k446cwxc00000w/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:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005339 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-28 02:32:17.912532) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-28 02:32:17.912811) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-28 02:32:17.916118) ========= ========= Total master_lag: 0.19 =========