builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-056 starttime: 1474462144.96 results: success (0) buildid: 20160921030221 builduid: 3de2c328b48f4de7a143e759679950e8 revision: e2d2897e4a7449759267bf168e6b37f7b8c3a94b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:04.965294) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:04.966347) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:04.966682) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:04.978867) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:04.979308) ========= 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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1474462144.380787-732135906 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-09-21 05:49:05-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 220M=0s 2016-09-21 05:49:05 (220 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.152061 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.147669) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.148517) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1474462144.380787-732135906 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018344 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.202742) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.203605) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev e2d2897e4a7449759267bf168e6b37f7b8c3a94b --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev e2d2897e4a7449759267bf168e6b37f7b8c3a94b --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1474462144.380787-732135906 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-09-21 05:49:05,470 truncating revision to first 12 chars 2016-09-21 05:49:05,470 Setting DEBUG logging. 2016-09-21 05:49:05,470 attempt 1/10 2016-09-21 05:49:05,470 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/e2d2897e4a74?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-21 05:49:05,776 unpacking tar archive at: mozilla-central-e2d2897e4a74/testing/mozharness/ program finished with exit code 0 elapsedTime=0.623248 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.845635) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.846426) ========= script_repo_revision: e2d2897e4a7449759267bf168e6b37f7b8c3a94b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.846881) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.847187) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-21 05:49:05.858201) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-09-21 05:49:05.858654) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1474462144.380787-732135906 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:49:06 INFO - MultiFileLogger online at 20160921 05:49:06 in /builds/slave/test 05:49:06 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 05:49:06 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:49:06 INFO - {'append_to_log': False, 05:49:06 INFO - 'base_work_dir': '/builds/slave/test', 05:49:06 INFO - 'blob_upload_branch': 'Firefox', 05:49:06 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:49:06 INFO - 'branch': 'Firefox', 05:49:06 INFO - 'buildbot_json_path': 'buildprops.json', 05:49:06 INFO - 'config_files': ('talos/linux_config.py',), 05:49:06 INFO - 'default_actions': ('clobber', 05:49:06 INFO - 'read-buildbot-config', 05:49:06 INFO - 'download-and-extract', 05:49:06 INFO - 'populate-webroot', 05:49:06 INFO - 'create-virtualenv', 05:49:06 INFO - 'install', 05:49:06 INFO - 'run-tests'), 05:49:06 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:49:06 INFO - 'download_minidump_stackwalk': True, 05:49:06 INFO - 'download_symbols': 'ondemand', 05:49:06 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:49:06 INFO - 'tooltool.py': '/tools/tooltool.py', 05:49:06 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:49:06 INFO - '/tools/misc-python/virtualenv.py')}, 05:49:06 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:49:06 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:49:06 INFO - 'installer_path': 'installer.exe', 05:49:06 INFO - 'log_level': 'info', 05:49:06 INFO - 'log_name': 'talos', 05:49:06 INFO - 'log_to_console': True, 05:49:06 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:49:06 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:49:06 INFO - 'opt_config_files': (), 05:49:06 INFO - 'pip_index': False, 05:49:06 INFO - 'sps_profile': False, 05:49:06 INFO - 'sps_profile_interval': 0, 05:49:06 INFO - 'suite': 'dromaeojs-e10s', 05:49:06 INFO - 'system_bits': '32', 05:49:06 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:49:06 INFO - 'title': 'talos-linux64-ix-056', 05:49:06 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:49:06 INFO - 'use_talos_json': True, 05:49:06 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:49:06 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:49:06 INFO - 'work_dir': 'build'} 05:49:06 INFO - [mozharness: 2016-09-21 12:49:06.213704Z] Running clobber step. 05:49:06 INFO - Running pre-action listener: _resource_record_pre_action 05:49:06 INFO - Running main action method: clobber 05:49:06 INFO - rmtree: /builds/slave/test/build 05:49:06 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:49:07 INFO - Running post-action listener: _resource_record_post_action 05:49:07 INFO - [mozharness: 2016-09-21 12:49:07.193429Z] Finished clobber step (success) 05:49:07 INFO - [mozharness: 2016-09-21 12:49:07.193529Z] Running read-buildbot-config step. 05:49:07 INFO - Running pre-action listener: _resource_record_pre_action 05:49:07 INFO - Running main action method: read_buildbot_config 05:49:07 INFO - Using buildbot properties: 05:49:07 INFO - { 05:49:07 INFO - "project": "", 05:49:07 INFO - "product": "firefox", 05:49:07 INFO - "script_repo_revision": "production", 05:49:07 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 05:49:07 INFO - "repository": "", 05:49:07 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 05:49:07 INFO - "buildid": "20160921030221", 05:49:07 INFO - "stage_platform": "linux64-pgo", 05:49:07 INFO - "basedir": "/builds/slave/test", 05:49:07 INFO - "nightly_build": "True", 05:49:07 INFO - "buildnumber": 181, 05:49:07 INFO - "slavename": "talos-linux64-ix-056", 05:49:07 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:49:07 INFO - "platform": "ubuntu64_hw", 05:49:07 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 05:49:07 INFO - "branch": "mozilla-central", 05:49:07 INFO - "repo_path": "mozilla-central", 05:49:07 INFO - "revision": "e2d2897e4a7449759267bf168e6b37f7b8c3a94b", 05:49:07 INFO - "pgo_build": "True", 05:49:07 INFO - "builduid": "3de2c328b48f4de7a143e759679950e8", 05:49:07 INFO - "slavebuilddir": "test" 05:49:07 INFO - } 05:49:07 INFO - Found installer url https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 05:49:07 INFO - Running post-action listener: _resource_record_post_action 05:49:07 INFO - [mozharness: 2016-09-21 12:49:07.196053Z] Finished read-buildbot-config step (success) 05:49:07 INFO - [mozharness: 2016-09-21 12:49:07.196143Z] Running download-and-extract step. 05:49:07 INFO - Running pre-action listener: _resource_record_pre_action 05:49:07 INFO - Running main action method: download_and_extract 05:49:07 INFO - mkdir: /builds/slave/test/build/tests 05:49: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')]} 05:49:07 INFO - trying https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 05:49:07 INFO - Downloading https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 05:49:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 05:49:07 INFO - Downloaded 1361 bytes. 05:49:07 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 05:49:07 INFO - Using the following test package requirements: 05:49:07 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 05:49:07 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:07 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:49:07 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:07 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:49:07 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:07 INFO - u'jsshell-linux-x86_64.zip'], 05:49:07 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:07 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:49:07 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 05:49:07 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:07 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:49:07 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:07 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:49:07 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:07 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:49:07 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:07 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:49:07 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:49:07 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 05:49:07 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:49:07 INFO - Fetch https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 05:49:08 INFO - Expected file size: 21941267 05:49:12 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:49:12 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 05:49:12 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:49:12 INFO - Fetch https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 05:49:13 INFO - Expected file size: 21941267 05:49:18 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 05:49:18 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:49:18 INFO - Fetch https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 05:49:18 INFO - Expected file size: 14414059 05:49:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:49:19 INFO - trying https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 05:49:19 INFO - Downloading https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 05:49:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:49:21 INFO - Downloaded 59597427 bytes. 05:49:21 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 05:49:21 INFO - mkdir: /builds/slave/test/properties 05:49:21 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:49:21 INFO - Writing to file /builds/slave/test/properties/build_url 05:49:21 INFO - Contents: 05:49:21 INFO - build_url:https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 05:49:22 INFO - Running post-action listener: _resource_record_post_action 05:49:22 INFO - Running post-action listener: set_extra_try_arguments 05:49:22 INFO - [mozharness: 2016-09-21 12:49:22.365082Z] Finished download-and-extract step (success) 05:49:22 INFO - [mozharness: 2016-09-21 12:49:22.365347Z] Running populate-webroot step. 05:49:22 INFO - Running pre-action listener: _resource_record_pre_action 05:49:22 INFO - Running main action method: populate_webroot 05:49:22 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:49:22 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:49:22 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:49:22 INFO - '--tppagecycles', 05:49:22 INFO - '7'], 05:49:22 INFO - 'tests': ['tsvgm']}}, 05:49:22 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:49:22 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:49:22 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:49:22 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:49:22 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:22 INFO - 'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:49:22 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:49:22 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:22 INFO - 'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['damp', 'tps']}, 05:49:22 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:22 INFO - 'tests': ['damp', 'tps']}, 05:49:22 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['dromaeo_dom']}, 05:49:22 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:49:22 INFO - 'g4': {'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['basic_compositor_video']}, 05:49:22 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 05:49:22 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['a11yr', 05:49:22 INFO - 'ts_paint', 05:49:22 INFO - 'tpaint', 05:49:22 INFO - 'sessionrestore', 05:49:22 INFO - 'sessionrestore_no_auto_restore', 05:49:22 INFO - 'tabpaint']}, 05:49:22 INFO - 'other-e10s': {'tests': ['a11yr', 05:49:22 INFO - 'ts_paint', 05:49:22 INFO - 'tpaint', 05:49:22 INFO - 'sessionrestore', 05:49:22 INFO - 'sessionrestore_no_auto_restore', 05:49:22 INFO - 'tabpaint']}, 05:49:22 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:49:22 INFO - 'ts_paint', 05:49:22 INFO - 'tpaint', 05:49:22 INFO - 'sessionrestore', 05:49:22 INFO - 'sessionrestore_no_auto_restore', 05:49:22 INFO - 'tabpaint']}, 05:49:22 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:49:22 INFO - 'ts_paint', 05:49:22 INFO - 'tpaint', 05:49:22 INFO - 'sessionrestore', 05:49:22 INFO - 'sessionrestore_no_auto_restore', 05:49:22 INFO - 'tabpaint']}, 05:49:22 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['a11yr', 05:49:22 INFO - 'ts_paint', 05:49:22 INFO - 'tpaint', 05:49:22 INFO - 'sessionrestore', 05:49:22 INFO - 'sessionrestore_no_auto_restore', 05:49:22 INFO - 'tabpaint']}, 05:49:22 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['a11yr', 05:49:22 INFO - 'ts_paint', 05:49:22 INFO - 'tpaint', 05:49:22 INFO - 'sessionrestore', 05:49:22 INFO - 'sessionrestore_no_auto_restore', 05:49:22 INFO - 'tabpaint']}, 05:49:22 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['tsvgx', 05:49:22 INFO - 'tsvgr_opacity', 05:49:22 INFO - 'tart', 05:49:22 INFO - 'tscrollx', 05:49:22 INFO - 'cart']}, 05:49:22 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:49:22 INFO - 'tsvgr_opacity', 05:49:22 INFO - 'tart', 05:49:22 INFO - 'tscrollx', 05:49:22 INFO - 'cart']}, 05:49:22 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:22 INFO - 'talos_options': ['--disable-e10s'], 05:49:22 INFO - 'tests': ['tp5o']}, 05:49:22 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:22 INFO - 'tests': ['tp5o']}, 05:49:22 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:22 INFO - 'talos_options': ['--disable-e10s', 05:49:22 INFO - '--xperf_path', 05:49:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:49:22 INFO - 'tests': ['tp5n']}, 05:49:22 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:22 INFO - 'talos_options': ['--xperf_path', 05:49:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:49:22 INFO - 'tests': ['tp5n']}}, 05:49:22 INFO - 'talos.zip': {'path': '', 05:49:22 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:49:22 INFO - Running post-action listener: _resource_record_post_action 05:49:22 INFO - [mozharness: 2016-09-21 12:49:22.383793Z] Finished populate-webroot step (success) 05:49:22 INFO - [mozharness: 2016-09-21 12:49:22.383882Z] Running create-virtualenv step. 05:49:22 INFO - Running pre-action listener: _resource_record_pre_action 05:49:22 INFO - Running main action method: create_virtualenv 05:49:22 INFO - Creating virtualenv /builds/slave/test/build/venv 05:49:22 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 05:49:22 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:49:22 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:49:22 INFO - Using real prefix '/usr' 05:49:22 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:49:23 INFO - Installing distribute.............................................................................................................................................................................................done. 05:49:24 INFO - Installing pip.................done. 05:49:24 INFO - Return code: 0 05:49:24 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:49: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')]} 05:49:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49: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')]} 05:49:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:24 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:24 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 05:49:24 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 05:49:24 INFO - Using env: {'DISPLAY': ':0', 05:49:24 INFO - 'HOME': '/home/cltbld', 05:49:24 INFO - 'LANG': 'en_US.UTF-8', 05:49:24 INFO - 'LANGUAGE': 'en_US:en', 05:49:24 INFO - 'LOGNAME': 'cltbld', 05:49:24 INFO - 'MAIL': '/var/mail/cltbld', 05:49:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:24 INFO - 'MOZ_NO_REMOTE': '1', 05:49:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:24 INFO - 'NO_EM_RESTART': '1', 05:49:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:24 INFO - 'PWD': '/builds/slave/test', 05:49:24 INFO - 'SHELL': '/bin/bash', 05:49:24 INFO - 'SHLVL': '1', 05:49:24 INFO - 'TERM': 'linux', 05:49:24 INFO - 'TMOUT': '86400', 05:49:24 INFO - 'USER': 'cltbld', 05:49:24 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:24 INFO - '_': '/tools/buildbot/bin/python'} 05:49:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:25 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 05:49:25 INFO - Cleaning up... 05:49:25 INFO - Return code: 0 05:49:25 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:49:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:49:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:49:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:25 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:25 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 05:49:25 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 05:49:25 INFO - Using env: {'DISPLAY': ':0', 05:49:25 INFO - 'HOME': '/home/cltbld', 05:49:25 INFO - 'LANG': 'en_US.UTF-8', 05:49:25 INFO - 'LANGUAGE': 'en_US:en', 05:49:25 INFO - 'LOGNAME': 'cltbld', 05:49:25 INFO - 'MAIL': '/var/mail/cltbld', 05:49:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:25 INFO - 'MOZ_NO_REMOTE': '1', 05:49:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:25 INFO - 'NO_EM_RESTART': '1', 05:49:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:25 INFO - 'PWD': '/builds/slave/test', 05:49:25 INFO - 'SHELL': '/bin/bash', 05:49:25 INFO - 'SHLVL': '1', 05:49:25 INFO - 'TERM': 'linux', 05:49:25 INFO - 'TMOUT': '86400', 05:49:25 INFO - 'USER': 'cltbld', 05:49:25 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:25 INFO - '_': '/tools/buildbot/bin/python'} 05:49:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:25 INFO - Downloading/unpacking psutil>=3.1.1 05:49:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:49:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:49:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:49:27 INFO - Installing collected packages: psutil 05:49:27 INFO - Running setup.py install for psutil 05:49:27 INFO - building 'psutil._psutil_linux' extension 05:49:27 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 05:49:27 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 05:49:27 INFO - building 'psutil._psutil_posix' extension 05:49:27 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 05:49:27 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 05:49:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:49:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:49:27 INFO - Successfully installed psutil 05:49:27 INFO - Cleaning up... 05:49:27 INFO - Return code: 0 05:49:27 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:49:27 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')]} 05:49:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:27 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')]} 05:49:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:27 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:27 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 05:49:27 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 05:49:27 INFO - Using env: {'DISPLAY': ':0', 05:49:27 INFO - 'HOME': '/home/cltbld', 05:49:27 INFO - 'LANG': 'en_US.UTF-8', 05:49:27 INFO - 'LANGUAGE': 'en_US:en', 05:49:27 INFO - 'LOGNAME': 'cltbld', 05:49:27 INFO - 'MAIL': '/var/mail/cltbld', 05:49:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:27 INFO - 'MOZ_NO_REMOTE': '1', 05:49:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:27 INFO - 'NO_EM_RESTART': '1', 05:49:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:27 INFO - 'PWD': '/builds/slave/test', 05:49:27 INFO - 'SHELL': '/bin/bash', 05:49:27 INFO - 'SHLVL': '1', 05:49:27 INFO - 'TERM': 'linux', 05:49:27 INFO - 'TMOUT': '86400', 05:49:27 INFO - 'USER': 'cltbld', 05:49:27 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:27 INFO - '_': '/tools/buildbot/bin/python'} 05:49:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:28 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:49:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:30 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:49:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:49:30 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:49:30 INFO - Installing collected packages: mozsystemmonitor 05:49:30 INFO - Running setup.py install for mozsystemmonitor 05:49:30 INFO - Successfully installed mozsystemmonitor 05:49:30 INFO - Cleaning up... 05:49:30 INFO - Return code: 0 05:49:30 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:49:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:49:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:49:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:30 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:30 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 05:49:30 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 05:49:30 INFO - Using env: {'DISPLAY': ':0', 05:49:30 INFO - 'HOME': '/home/cltbld', 05:49:30 INFO - 'LANG': 'en_US.UTF-8', 05:49:30 INFO - 'LANGUAGE': 'en_US:en', 05:49:30 INFO - 'LOGNAME': 'cltbld', 05:49:30 INFO - 'MAIL': '/var/mail/cltbld', 05:49:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:30 INFO - 'MOZ_NO_REMOTE': '1', 05:49:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:30 INFO - 'NO_EM_RESTART': '1', 05:49:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:30 INFO - 'PWD': '/builds/slave/test', 05:49:30 INFO - 'SHELL': '/bin/bash', 05:49:30 INFO - 'SHLVL': '1', 05:49:30 INFO - 'TERM': 'linux', 05:49:30 INFO - 'TMOUT': '86400', 05:49:30 INFO - 'USER': 'cltbld', 05:49:30 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:30 INFO - '_': '/tools/buildbot/bin/python'} 05:49:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:30 INFO - Downloading/unpacking jsonschema==2.5.1 05:49:30 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 05:49:30 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 05:49:30 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 05:49:30 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 05:49:30 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 05:49:30 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 05:49:32 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:49:32 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:49: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 05:49: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 05:49: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 05:49: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 05:49: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 05:49: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 05:49:32 INFO - Downloading functools32-3.2.3-2.tar.gz 05:49:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:49:32 INFO - warning: no files found matching '*.txt' 05:49:32 INFO - no previously-included directories found matching 'build' 05:49:32 INFO - no previously-included directories found matching 'dist' 05:49:32 INFO - no previously-included directories found matching '.git*' 05:49:32 INFO - Installing collected packages: jsonschema, functools32 05:49:32 INFO - Running setup.py install for functools32 05:49:32 INFO - warning: no files found matching '*.txt' 05:49:32 INFO - no previously-included directories found matching 'build' 05:49:32 INFO - no previously-included directories found matching 'dist' 05:49:32 INFO - no previously-included directories found matching '.git*' 05:49:32 INFO - Successfully installed jsonschema functools32 05:49:32 INFO - Cleaning up... 05:49:32 INFO - Return code: 0 05:49:32 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 05:49: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')]} 05:49:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49: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')]} 05:49:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49: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', '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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49: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', 'functools32==3.2.3-2'] in /builds/slave/test/build 05:49: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 functools32==3.2.3-2 05:49:32 INFO - Using env: {'DISPLAY': ':0', 05:49:32 INFO - 'HOME': '/home/cltbld', 05:49:32 INFO - 'LANG': 'en_US.UTF-8', 05:49:32 INFO - 'LANGUAGE': 'en_US:en', 05:49:32 INFO - 'LOGNAME': 'cltbld', 05:49:32 INFO - 'MAIL': '/var/mail/cltbld', 05:49:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:32 INFO - 'MOZ_NO_REMOTE': '1', 05:49:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:32 INFO - 'NO_EM_RESTART': '1', 05:49:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:32 INFO - 'PWD': '/builds/slave/test', 05:49:32 INFO - 'SHELL': '/bin/bash', 05:49:32 INFO - 'SHLVL': '1', 05:49:32 INFO - 'TERM': 'linux', 05:49:32 INFO - 'TMOUT': '86400', 05:49:32 INFO - 'USER': 'cltbld', 05:49:32 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:32 INFO - '_': '/tools/buildbot/bin/python'} 05:49:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:33 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 05:49:33 INFO - Cleaning up... 05:49:33 INFO - Return code: 0 05:49:33 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:49:33 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')]} 05:49:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:33 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')]} 05:49:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:33 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:33 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 05:49:33 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 05:49:33 INFO - Using env: {'DISPLAY': ':0', 05:49:33 INFO - 'HOME': '/home/cltbld', 05:49:33 INFO - 'LANG': 'en_US.UTF-8', 05:49:33 INFO - 'LANGUAGE': 'en_US:en', 05:49:33 INFO - 'LOGNAME': 'cltbld', 05:49:33 INFO - 'MAIL': '/var/mail/cltbld', 05:49:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:33 INFO - 'MOZ_NO_REMOTE': '1', 05:49:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:33 INFO - 'NO_EM_RESTART': '1', 05:49:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:33 INFO - 'PWD': '/builds/slave/test', 05:49:33 INFO - 'SHELL': '/bin/bash', 05:49:33 INFO - 'SHLVL': '1', 05:49:33 INFO - 'TERM': 'linux', 05:49:33 INFO - 'TMOUT': '86400', 05:49:33 INFO - 'USER': 'cltbld', 05:49:33 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:33 INFO - '_': '/tools/buildbot/bin/python'} 05:49:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:33 INFO - Downloading/unpacking blobuploader==1.2.4 05:49:33 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 05:49:33 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 05:49:33 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 05:49:33 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 05:49:33 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 05:49:33 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 05:49:35 INFO - Downloading blobuploader-1.2.4.tar.gz 05:49:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:49:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:49:35 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 05:49:35 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 05:49:35 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 05:49:35 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 05:49:35 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 05:49:35 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 05:49:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:49:35 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:49:35 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 05:49:35 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 05:49:35 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 05:49:35 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 05:49:35 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 05:49:35 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 05:49:35 INFO - Downloading docopt-0.6.1.tar.gz 05:49:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:49:35 INFO - Installing collected packages: blobuploader, requests, docopt 05:49:35 INFO - Running setup.py install for blobuploader 05:49:36 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:49:36 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:49:36 INFO - Running setup.py install for requests 05:49:36 INFO - Running setup.py install for docopt 05:49:36 INFO - Successfully installed blobuploader requests docopt 05:49:36 INFO - Cleaning up... 05:49:36 INFO - Return code: 0 05:49:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:49:36 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')]} 05:49:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:36 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')]} 05:49:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:36 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:36 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 05:49:36 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 05:49:36 INFO - Using env: {'DISPLAY': ':0', 05:49:36 INFO - 'HOME': '/home/cltbld', 05:49:36 INFO - 'LANG': 'en_US.UTF-8', 05:49:36 INFO - 'LANGUAGE': 'en_US:en', 05:49:36 INFO - 'LOGNAME': 'cltbld', 05:49:36 INFO - 'MAIL': '/var/mail/cltbld', 05:49:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:36 INFO - 'MOZ_NO_REMOTE': '1', 05:49:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:36 INFO - 'NO_EM_RESTART': '1', 05:49:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:36 INFO - 'PWD': '/builds/slave/test', 05:49:36 INFO - 'SHELL': '/bin/bash', 05:49:36 INFO - 'SHLVL': '1', 05:49:36 INFO - 'TERM': 'linux', 05:49:36 INFO - 'TMOUT': '86400', 05:49:36 INFO - 'USER': 'cltbld', 05:49:36 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:36 INFO - '_': '/tools/buildbot/bin/python'} 05:49:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:49:36 INFO - Running setup.py (path:/tmp/pip-8nQMbZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:49:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:49:36 INFO - Running setup.py (path:/tmp/pip-HiFMkg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:49:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:49:36 INFO - Running setup.py (path:/tmp/pip-w5SVVw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:49:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:49:36 INFO - Running setup.py (path:/tmp/pip-21I1Bz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:49:37 INFO - Running setup.py (path:/tmp/pip-55M3MG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:49:37 INFO - Running setup.py (path:/tmp/pip-ocQIWM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:49:37 INFO - Running setup.py (path:/tmp/pip-0ilYu7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:49:37 INFO - Running setup.py (path:/tmp/pip-EJSOnw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:49:37 INFO - Running setup.py (path:/tmp/pip-c7c9RW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:49:37 INFO - Running setup.py (path:/tmp/pip-SNinw5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:49:37 INFO - Running setup.py (path:/tmp/pip-EoMdlT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:49:37 INFO - Running setup.py (path:/tmp/pip-yE0tZI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:49:37 INFO - Running setup.py (path:/tmp/pip-gwKf2_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:49:37 INFO - Running setup.py (path:/tmp/pip-u_veqt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:49:37 INFO - Running setup.py (path:/tmp/pip-Wxp1wd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:49:37 INFO - Running setup.py (path:/tmp/pip-S0QlbZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:49:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:49:37 INFO - Running setup.py (path:/tmp/pip-wCUeq9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:49:37 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:49:37 INFO - Running setup.py install for manifestparser 05:49:38 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Running setup.py install for mozcrash 05:49:38 INFO - Running setup.py install for mozdebug 05:49:38 INFO - Running setup.py install for mozdevice 05:49:38 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Running setup.py install for mozfile 05:49:38 INFO - Running setup.py install for mozhttpd 05:49:38 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Running setup.py install for mozinfo 05:49:38 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Running setup.py install for mozInstall 05:49:38 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:49:38 INFO - Running setup.py install for mozleak 05:49:38 INFO - Running setup.py install for mozlog 05:49:39 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:49:39 INFO - Running setup.py install for moznetwork 05:49:39 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:49:39 INFO - Running setup.py install for mozprocess 05:49:39 INFO - Running setup.py install for mozprofile 05:49:39 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:49:39 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:49:39 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:49:39 INFO - Running setup.py install for mozrunner 05:49:39 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:49:39 INFO - Running setup.py install for mozscreenshot 05:49:39 INFO - Running setup.py install for moztest 05:49:39 INFO - Running setup.py install for mozversion 05:49:39 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:49:39 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:49:39 INFO - Cleaning up... 05:49:39 INFO - Return code: 0 05:49:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:49:39 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')]} 05:49:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:39 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')]} 05:49:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:39 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:39 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 05:49:39 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 05:49:39 INFO - Using env: {'DISPLAY': ':0', 05:49:39 INFO - 'HOME': '/home/cltbld', 05:49:39 INFO - 'LANG': 'en_US.UTF-8', 05:49:39 INFO - 'LANGUAGE': 'en_US:en', 05:49:39 INFO - 'LOGNAME': 'cltbld', 05:49:39 INFO - 'MAIL': '/var/mail/cltbld', 05:49:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:39 INFO - 'MOZ_NO_REMOTE': '1', 05:49:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:39 INFO - 'NO_EM_RESTART': '1', 05:49:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:39 INFO - 'PWD': '/builds/slave/test', 05:49:39 INFO - 'SHELL': '/bin/bash', 05:49:39 INFO - 'SHLVL': '1', 05:49:39 INFO - 'TERM': 'linux', 05:49:39 INFO - 'TMOUT': '86400', 05:49:39 INFO - 'USER': 'cltbld', 05:49:39 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:39 INFO - '_': '/tools/buildbot/bin/python'} 05:49:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:49:40 INFO - Running setup.py (path:/tmp/pip-FdGaXJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:49:40 INFO - Running setup.py (path:/tmp/pip-0JvfMe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:49:40 INFO - Running setup.py (path:/tmp/pip-oX3pMr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:49:40 INFO - Running setup.py (path:/tmp/pip-RCR2io-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:49:40 INFO - Running setup.py (path:/tmp/pip-QXia2q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:49:40 INFO - Running setup.py (path:/tmp/pip-eqHW_8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:49:40 INFO - Running setup.py (path:/tmp/pip-qH5_cc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:49:40 INFO - Running setup.py (path:/tmp/pip-uauoDH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:49:40 INFO - Running setup.py (path:/tmp/pip-yAWG_5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:49:40 INFO - Running setup.py (path:/tmp/pip-rf8Vd1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:49:40 INFO - Running setup.py (path:/tmp/pip-SycUuv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:49:40 INFO - Running setup.py (path:/tmp/pip-Dd_k40-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:49:40 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)) 05:49:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:49:40 INFO - Running setup.py (path:/tmp/pip-iIKSxS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:49:41 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)) 05:49:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:49:41 INFO - Running setup.py (path:/tmp/pip-OQ1177-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:49:41 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)) 05:49:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:49:41 INFO - Running setup.py (path:/tmp/pip-x7InKR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:49:41 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)) 05:49:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:49:41 INFO - Running setup.py (path:/tmp/pip-OtuRtX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:49:41 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)) 05:49:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:49:41 INFO - Running setup.py (path:/tmp/pip-QV7fT6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:49:41 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)) 05:49:41 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)) 05:49:41 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)) 05:49:41 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)) 05:49:41 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)) 05:49:41 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)) 05:49:41 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:49:41 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 05:49:41 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 05:49:41 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 05:49:41 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 05:49:41 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 05:49:41 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 05:49:43 INFO - Downloading blessings-1.6.tar.gz 05:49:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:49:43 INFO - Installing collected packages: blessings 05:49:43 INFO - Running setup.py install for blessings 05:49:43 INFO - Successfully installed blessings 05:49:43 INFO - Cleaning up... 05:49:43 INFO - Return code: 0 05:49:43 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:49:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:49:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:49:43 INFO - Reading from file tmpfile_stdout 05:49:43 INFO - Current package versions: 05:49:43 INFO - argparse == 1.2.1 05:49:43 INFO - blessings == 1.6 05:49:43 INFO - blobuploader == 1.2.4 05:49:43 INFO - docopt == 0.6.1 05:49:43 INFO - functools32 == 3.2.3-2 05:49:43 INFO - jsonschema == 2.5.1 05:49:43 INFO - manifestparser == 1.1 05:49:43 INFO - mozInstall == 1.12 05:49:43 INFO - mozcrash == 0.17 05:49:43 INFO - mozdebug == 0.1 05:49:43 INFO - mozdevice == 0.48 05:49:43 INFO - mozfile == 1.2 05:49:43 INFO - mozhttpd == 0.7 05:49:43 INFO - mozinfo == 0.9 05:49:43 INFO - mozleak == 0.1 05:49:43 INFO - mozlog == 3.4 05:49:43 INFO - moznetwork == 0.27 05:49:43 INFO - mozprocess == 0.23 05:49:43 INFO - mozprofile == 0.28 05:49:43 INFO - mozrunner == 6.12 05:49:43 INFO - mozscreenshot == 0.1 05:49:43 INFO - mozsystemmonitor == 0.3 05:49:43 INFO - moztest == 0.7 05:49:43 INFO - mozversion == 1.4 05:49:43 INFO - psutil == 3.1.1 05:49:43 INFO - requests == 1.2.3 05:49:43 INFO - wsgiref == 0.1.2 05:49:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:49: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')]} 05:49:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49: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')]} 05:49:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:43 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:43 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 05:49:43 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 05:49:43 INFO - Using env: {'DISPLAY': ':0', 05:49:43 INFO - 'HOME': '/home/cltbld', 05:49:43 INFO - 'LANG': 'en_US.UTF-8', 05:49:43 INFO - 'LANGUAGE': 'en_US:en', 05:49:43 INFO - 'LOGNAME': 'cltbld', 05:49:43 INFO - 'MAIL': '/var/mail/cltbld', 05:49:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:43 INFO - 'MOZ_NO_REMOTE': '1', 05:49:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:43 INFO - 'NO_EM_RESTART': '1', 05:49:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:43 INFO - 'PWD': '/builds/slave/test', 05:49:43 INFO - 'SHELL': '/bin/bash', 05:49:43 INFO - 'SHLVL': '1', 05:49:43 INFO - 'TERM': 'linux', 05:49:43 INFO - 'TMOUT': '86400', 05:49:43 INFO - 'USER': 'cltbld', 05:49:43 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:43 INFO - '_': '/tools/buildbot/bin/python'} 05:49:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 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)) 05:49:44 INFO - Cleaning up... 05:49:44 INFO - Return code: 0 05:49:44 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:49:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:49:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:49:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:44 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 0x7fc789b29f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19fe7b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:44 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 05:49:44 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 05:49:44 INFO - Using env: {'DISPLAY': ':0', 05:49:44 INFO - 'HOME': '/home/cltbld', 05:49:44 INFO - 'LANG': 'en_US.UTF-8', 05:49:44 INFO - 'LANGUAGE': 'en_US:en', 05:49:44 INFO - 'LOGNAME': 'cltbld', 05:49:44 INFO - 'MAIL': '/var/mail/cltbld', 05:49:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:44 INFO - 'MOZ_NO_REMOTE': '1', 05:49:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:44 INFO - 'NO_EM_RESTART': '1', 05:49:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:44 INFO - 'PWD': '/builds/slave/test', 05:49:44 INFO - 'SHELL': '/bin/bash', 05:49:44 INFO - 'SHLVL': '1', 05:49:44 INFO - 'TERM': 'linux', 05:49:44 INFO - 'TMOUT': '86400', 05:49:44 INFO - 'USER': 'cltbld', 05:49:44 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:49:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:44 INFO - '_': '/tools/buildbot/bin/python'} 05:49:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:44 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:49:44 INFO - Cleaning up... 05:49:44 INFO - Return code: 0 05:49:44 INFO - Running post-action listener: _resource_record_post_action 05:49:44 INFO - Running post-action listener: _start_resource_monitoring 05:49:44 INFO - Starting resource monitoring. 05:49:44 INFO - [mozharness: 2016-09-21 12:49:44.299165Z] Finished create-virtualenv step (success) 05:49:44 INFO - [mozharness: 2016-09-21 12:49:44.299624Z] Running install step. 05:49:44 INFO - Running pre-action listener: _resource_record_pre_action 05:49:44 INFO - Running main action method: install 05:49:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:49:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:49:44 INFO - Reading from file tmpfile_stdout 05:49:44 INFO - Detecting whether we're running mozinstall >=1.0... 05:49:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:49:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:49:44 INFO - Reading from file tmpfile_stdout 05:49:44 INFO - Output received: 05:49:44 INFO - Usage: mozinstall [options] installer 05:49:44 INFO - Options: 05:49:44 INFO - -h, --help show this help message and exit 05:49:44 INFO - -d DEST, --destination=DEST 05:49:44 INFO - Directory to install application into. [default: 05:49:44 INFO - "/builds/slave/test"] 05:49:44 INFO - --app=APP Application being installed. [default: firefox] 05:49:44 INFO - mkdir: /builds/slave/test/build/application 05:49:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:49:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 05:50:01 INFO - Reading from file tmpfile_stdout 05:50:01 INFO - Output received: 05:50:01 INFO - /builds/slave/test/build/application/firefox/firefox 05:50:01 INFO - Running post-action listener: _resource_record_post_action 05:50:01 INFO - [mozharness: 2016-09-21 12:50:01.589185Z] Finished install step (success) 05:50:01 INFO - [mozharness: 2016-09-21 12:50:01.589475Z] Running run-tests step. 05:50:01 INFO - Running pre-action listener: _resource_record_pre_action 05:50:01 INFO - Running main action method: run_tests 05:50:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:50:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:50:01 INFO - Python 2.7.3 05:50:01 INFO - Return code: 0 05:50:01 INFO - grabbing minidump binary from tooltool 05:50:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:50:01 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/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 0x1a8d790>, '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 0x1a8e690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a8eb20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:50:01 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 05:50:01 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 05:50:01 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/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 05:50:01 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:50:01 INFO - Return code: 0 05:50:01 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:50:01 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:50:01 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:50:01 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:50:01 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:50:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-056', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 05:50:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-056 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:50:01 INFO - Using env: {'DISPLAY': ':0', 05:50:01 INFO - 'HOME': '/home/cltbld', 05:50:01 INFO - 'LANG': 'en_US.UTF-8', 05:50:01 INFO - 'LANGUAGE': 'en_US:en', 05:50:01 INFO - 'LOGNAME': 'cltbld', 05:50:01 INFO - 'MAIL': '/var/mail/cltbld', 05:50:01 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:50:01 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:50:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:50:01 INFO - 'MOZ_NO_REMOTE': '1', 05:50:01 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:50:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:50:01 INFO - 'NO_EM_RESTART': '1', 05:50:01 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:50:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:50:01 INFO - 'PWD': '/builds/slave/test', 05:50:01 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:50:01 INFO - 'SHELL': '/bin/bash', 05:50:01 INFO - 'SHLVL': '1', 05:50:01 INFO - 'TERM': 'linux', 05:50:01 INFO - 'TMOUT': '86400', 05:50:01 INFO - 'USER': 'cltbld', 05:50:01 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1474462144.380787-732135906', 05:50:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:50:01 INFO - '_': '/tools/buildbot/bin/python'} 05:50:01 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-056', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:50:01 INFO - mozversion application_buildid: 20160921030221 05:50:01 INFO - mozversion application_changeset: e2d2897e4a7449759267bf168e6b37f7b8c3a94b 05:50:01 INFO - mozversion application_display_name: Nightly 05:50:01 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:50:01 INFO - mozversion application_name: Firefox 05:50:01 INFO - mozversion application_remotingname: firefox 05:50:01 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 05:50:01 INFO - mozversion application_vendor: Mozilla 05:50:01 INFO - mozversion application_version: 52.0a1 05:50:01 INFO - mozversion platform_buildid: 20160921030221 05:50:01 INFO - mozversion platform_changeset: e2d2897e4a7449759267bf168e6b37f7b8c3a94b 05:50:01 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 05:50:01 INFO - mozversion platform_version: 52.0a1 05:50:01 INFO - using testdate: 1474462201 05:50:01 INFO - actual date: 1474462201 05:50:01 INFO - starting webserver on 'localhost:58219' 05:50:01 INFO - SUITE-START | Running 2 tests 05:50:01 INFO - TEST-START | dromaeo_css 05:50:01 INFO - operating with platform_type : linux_ 05:50:01 INFO - Initialising browser for dromaeo_css test... 05:50:01 INFO - TEST-INFO | started process 30080 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpLIuCVC/profile http://localhost:58219/getInfo.html) 05:50:06 INFO - PROCESS | 30080 | __metrics Screen width/height:1600/1200 05:50:06 INFO - PROCESS | 30080 | colorDepth:24 05:50:06 INFO - PROCESS | 30080 | Browser inner width/height: 1024/697 05:50:06 INFO - PROCESS | 30080 | __metrics 05:50:07 ERROR - PROCESS | 30080 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 05:50:08 INFO - TEST-INFO | 30080: exit 0 05:50:08 INFO - Browser initialized. 05:50:08 INFO - Running cycle 1/1 for dromaeo_css test... 05:50:08 INFO - TEST-INFO | started process 30202 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpLIuCVC/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:50:20 INFO - PROCESS | 30202 | RSS: Main: 185131008 05:50:20 INFO - PROCESS | 30202 | 05:51:10 INFO - PROCESS | 30202 | 1474462270123 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] 05:53:19 INFO - PROCESS | 30202 | Cycle 1(1): loaded http://localhost:58219/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58219/tests/dromaeo/cssquery-ext.html) 05:53:21 INFO - PROCESS | 30202 | RSS: Main: 201646080 05:53:21 INFO - PROCESS | 30202 | 05:56:23 INFO - PROCESS | 30202 | Cycle 1(1): loaded http://localhost:58219/tests/dromaeo/cssquery-ext.html (next: http://localhost:58219/tests/dromaeo/cssquery-jquery.html) 05:56:24 INFO - PROCESS | 30202 | RSS: Main: 200577024 05:56:24 INFO - PROCESS | 30202 | 05:59:26 INFO - PROCESS | 30202 | Cycle 1(1): loaded http://localhost:58219/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58219/tests/dromaeo/cssquery-mootools.html) 05:59:26 INFO - PROCESS | 30202 | RSS: Main: 198320128 05:59:26 INFO - PROCESS | 30202 | 06:02:28 INFO - PROCESS | 30202 | Cycle 1(1): loaded http://localhost:58219/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58219/tests/dromaeo/cssquery-prototype.html) 06:02:29 INFO - PROCESS | 30202 | RSS: Main: 195354624 06:02:29 INFO - PROCESS | 30202 | 06:05:31 INFO - PROCESS | 30202 | Cycle 1(1): loaded http://localhost:58219/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58219/tests/dromaeo/cssquery-yui.html) 06:05:32 INFO - PROCESS | 30202 | RSS: Main: 198860800 06:05:32 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | Cycle 1(1): loaded http://localhost:58219/tests/dromaeo/cssquery-yui.html (next: http://localhost:58219/tests/dromaeo/cssquery-dojo.html) 06:08:35 INFO - PROCESS | 30202 | RSS: Main: 198987776 06:08:35 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | __start_tp_report 06:08:35 INFO - PROCESS | 30202 | _x_x_mozilla_page_load 06:08:35 INFO - PROCESS | 30202 | _x_x_mozilla_page_load_details 06:08:35 INFO - PROCESS | 30202 | |i|pagename|runs| 06:08:35 INFO - PROCESS | 30202 | |0;dojo.html;3058.785884988051;3058.9388212235754;3066.7393271571914;3096.520039393894;3113.299507610789;5165.81919632812;5332.226827110072;5346.786128554858;5358.705271210082;5445.945540544603;5229.424763276046;5346.251524786523;5362.329708786402;5381.0852155133625;5407.756650950707;4890.193118135512;4918.893249018978;4924.4583095859425;4925.261210818388;4990.326305948687;4907.803687852482;4949.257611358289;5007.273945277951;5018.673786203904;5021.372328458942;4680.906381872343;4741.407324084489;4817.470078291385;4851.805927762885;4967.751612419383;4888.804447822083;4892.363992680965;4925.113479573675;4928.6303527235605;4943.357363542752;4820.831270905536;4867.367242258484;4869.82955596556;4889.975550122226;4922.680025798311;5061;5145.485451454824;5279.841604751864;5316.149416093406;5356.035913535562;5715.171300161495;5739.426057394227;5744.396838331999;5746.683932383718;5792.8841423171725;5766.942330576682;5778.59549831512;5780.797672081499;5783.8554036149435;5794.913076303858;5164.870878228036;5213.7393130343335;5332.413434522199;5335.679859208382;5389.380221274525;5798.797042103506;5892.705364731746;5900.232969713996;5955.970220148958;5961.582689211714;5651.4348565143155;5657.349404818498;5665.858353541194;5667.744951477193;5674.921764864663;5401.675899445967;5406.378266499403;5679.659220446786;5714.371419143891;5714.914276285859;5451.509364157245;5488.17677348401;5493.587980901369;5496.093144631171;5497.038018346773;5520.227168196456;5521.365043020104;5525.392206857243;5677.829665110054;5707.143928410772;4441.7779111044965;4445.355423463579;4475.753833539186;4491.034427598082;4499.910001800011;3927.66614837742;3951.4863067801;3954.762714237155;3962.187751510933;3998.4402183694306;5261.447548007481;5278.366596008504;5350.438203988603;5463.48096930791;5558.694271815089;5574.1917421973585;5655.660660360391;5672.659640421588;5704.71476426177;5709.914351284734;5357.1696387060065;5363.758630861621;5371.75827087782;5381.300430943952;5417.864553386197;4765.1660959331975;4860.878478038077;4886.364772579542;4937.21004639256;4973.055119527278;5820.941790582125;5824.417558244142;5848.385919478478;5854.853628659318;5866.1494083357675;5653.462921022497;5655.123455864347;5664.631798933056;5667.631603945731;5679.204911312502;5946.910796337972;5975.910361344497;5980.3421623622235;6077.392260773887;6105.6947152641305;5648.971755141198;5701.942980570141;5702.543796496353;5702.828915132387;5709.34342550612;5501.752421140978;5558.333000040021;5804.564657650609;5815.098659707752;5822.475977162076;5498.257735205696;5541.889162216652;5569.582281328835;5582.86042848932;5649.915251271316;5567.415421380859;5567.944320556742;5570.470805273492;5572.247746554325;5580.665160090408;5340.439253878442;5500.972495137498;5509.586780991522;5514.393416724238;5569.805056822992;5392.245085688085;5439.5920305976415;5522.530584900329;5534.086875665631;5553.194786755978;5249.2126181073145;5492.588055895744;5502.312210973629;5561.860953476195;5572.442755724395 06:08:35 INFO - PROCESS | 30202 | |1;ext.html;575.6172145523227;580.4021857486788;584.2871696530232;586.258383145321;593.7239183779542;41444.79277603611;43654.56345436549;43846.78076609616;47236;47330.76334618331;44915.77542112293;45174.32238516425;45403.77298113505;45404;45578;8856.424332418388;8999.550022498848;9002.504862232574;9009.594568244445;9023.323250756186;8795.780105497382;8796.516191609458;8880.24517915978;8902;8914.821703565925;8843.071477494866;8848.5575721214;8872.645094196225;8876;8927.95536022319;8780.604872780741;8845.115488451167;8854.645814167425;8862.15809498103;8921.107889211093;8574.22831945128;8675.305975521944;8679.17547832955;8705.260052895512;8754.299656027566;41842.37236441456;41962.8037196281;42403.7879810599;42468.78765606183;42485;3505.7370697197557;3593.2993066352074;3607.1703508193;3619.963800361989;3675.5773086095173;31800.363992720246;32245.838770805996;32263.354732905445;32444;32453.6754632453;4374.300111982099;4447.444069491314;4574.794134263966;4636.211843986531;4648.163975229765;348718;353060;354088;354299;354482;55390.44609553853;55472;55677.72161139168;55751.72124139434;56236;35491.64508354935;36177;36477.27045459076;37958.62041379551;38050;16498.917505412635;16558.089305088335;16656.6668666626;16667.666646667;16741.91629041847;12694.42875070624;12842.101052926393;12906.67733306675;12924.41840117197;12926.353682315847;18814;18902.621947561245;18985.620287594447;19041.61916761657;19069.61860762777;6902.551334163263;7014.894776578355;7114.920653949353;7165.820854478576;7278.781636550912;917.9816403671889;989.7278248481581;1003.5433877585681;1004.3672486333563;1043.1029314789275;31993;32010.839945800122;32203.677963220067;32235.35529289401;32381;971.9854202186973;1090.1932569898377;1096.6929259807266;1110.7167672243527;1164.3130552973787;14983.925080374529;16276.26756795947;16295.859289849834;16421.261043253082;16445.506634800975;545362;554028;554143;554266;554625;56240.43759562434;56249.7187514068;56358.7182064087;56368;56602.15096773551;1320.1155225998605;1345.488714288564;1403.9578812635636;1409.5278081842698;1417.0788987158223;29502.852485737432;30251.394972099995;30620.387592248477;30943.381132377675;31329.53005704962;48650.5134948646;48952.51047489479;49197.50802491929;49236.2614560789;49256.26115608197;464440;467187;468913;471795;472640;27629.447411052068;27900;28292.15123546297;28394.290142746595;28398.43203135967;46478.53521464877;46967.29549056835;47162.52837471581;47683.52316476929;48673.513264868314;39968.20063598653;40742.1851562973;40761.79619101885;40921.1815763689;42103.36844947267;38720.2255954885;38962.415563766;39521;40164.1967160661;41266;39916.40125398179;39966.40050399304;40708.1858362837;40849.38725919173;44348.556514434444;31002;36204;37031.62968370282;37772;38516.229675405775;27401.177964661092;27972.72027279701;28363.716362836934;28412.431751364442;28477.857610712643 06:08:35 INFO - PROCESS | 30202 | |2;jquery.html;391.82367934429516;395.2371922190175;405.86403554809135;407.1287444867982;412.83486605357854;14719.779203311959;18559.72160417593;19235.326763563276;20094;20183.495412614673;18862.43412697618;19257.614847703073;19383.806161938377;19421.805781942177;19494.22023119077;5547.362053363874;5592.245046918675;5731.942680573183;5750.597458177929;5754.625949313281;5664.490195882369;5751.223584816059;5775.191473193735;5778.133280007991;5786.884262314751;5506.697131657757;5675.858103547403;5681.7727290908315;5693.060644993571;5706.3722990471015;5402.864928376822;5647.463490968393;5655.179998900177;5672.631278966875;5682.261306030231;5444.8366549003595;5555.833325000256;5606.187102870061;5616.887662246773;5640.605157638967;12808.935955320258;12948.54680086202;20683.172673093057;21251.149954001823;21476.677849832264;2427.635854621803;2430.4045508850268;2433.914812981537;2437.7805997460314;2864.627598412214;9227.400218985744;9476.478793666345;9648.98685638012;9800.411975281506;10143.087122158968;1879.5113270549618;1940.9320673776492;1951.1902560437402;1968.4881930698123;2010.7486564179478;80182.59908700419;85438;87622;88292.55853720754;89794.55102724509;10051.899481005243;10377.740556485996;10594.099501542456;10881;10898.945505272422;12396.31820249895;13115.147515411467;14702.117872927658;14729.337179826933;14737.926310368379;7589.58257295854;7794.8051298716855;7824.726134585376;7957.641906114123;8136.267735903797;7692.7692169235015;7736.729214477579;7787.688492460238;7954.642041108164;7980.241877021674;3872.6901847852105;3987.362022076512;4101.159262351211;4105.85629502966;4205.810738516774;1914.5117994911209;1915.1477592471217;1926.3354142820704;1934.303650685752;1978.881267123977;896.4755617963434;909.8453262945183;956.7273327101742;965.4062751407974;1082.0856376361962;18185.818141818414;18535.165917533745;18822.529436763918;18977.240910363707;19390.4182874514;976.3312131190157;981.8723565936525;995.3878364805593;998.1266391907081;1038.4755698372273;10117.59529618807;10562.894371056345;10615.84076238857;10640.308379955279;10667.626633067805;439458;468492;480010;480813;481576;91036.54481727548;92486;93992;94979.52510237404;95461;975.7755716185317;986.4673076538733;1045.2369770067894;1045.3884477580548;1068.1988508618535;16102.516924492284;16699.415520456725;17145.142742863056;17180.91409542944;17260.12910177494;30294;39502.40746388749;41497;41968;42516.57483425126;54933.72533137309;55764;57382.13926791185;58053.709731451076;59003;7016.929830701832;7390;8239.464434811718;8282.71010514629;8517.659293628185;11260.380679062402;12503.499860005499;12762.61712148637;13148.408321625358;13206.867931320563;11273;11273.323600583992;11471.598494052669;11644.53421863116;12022.75954480923;11218.887811122111;11228.831567526657;11408.315501069963;11563.826542602035;11633.767324653629;11651.941740291244;11773.47019384147;11788.23376480526;11873.940630296793;12181.69545761363;7372.557646541225;7538.547687138789;7587.658555365132;7745.380369570534;8065.435419520577;11186.664400068012;11607.593734219261;11948.76102477963;12043.939780301393;12101.878981210075 06:08:35 INFO - PROCESS | 30202 | |3;mootools.html;1437.073087858331;1479.6300924768807;1612.7500237463198;1654.239050036983;1711.1358763824267;7417.629118544065;7716.614169291541;8446.450980686259;9127.178553930136;9130.452172869624;8498.830023399529;8787.47275163489;8794.95602521988;9015.233705135055;9024.368294219406;2404.5070760494145;2436.4030812450974;2437.1348171399077;2456.520978409211;2464.297675162579;2377.1561095811;2400.435897564071;2423.127674037354;2435.135526887947;2435.305937807725;2417.6736140621056;2420.467497150633;2452.2520631207476;2471.765182307678;2478.2565230430887;2308.4113551044543;2318.0296747764432;2320.663503791949;2330.9650355244685;2352.9764702352927;2325.5232677301283;2346.5424242272766;2353.199912029918;2353.223436266028;2365.5924724788897;8818.382713210078;9047.457152570867;9087.40931839435;9164.8625270621;9166.86249706255;5428.9185662215095;5557.861053473655;5563.664720467059;5596.524295434893;5604.243427137325;3470.6008808987035;3498.807565583892;3508.824558772051;3519.9472007919903;3584.175639602906;1153.463639407671;1176.9117316201318;1206.849143857018;1229.0966139887175;2178.9891050544807;12615.432305546272;12637.873621263761;12655.367231638473;12717.936410317981;12739;4690.085433340534;4691.835785747482;4741.051789642016;4757.167495688241;4817.686850354716;9815;9840.65557705477;9870.802583948425;9887.110160085627;9909.554070066864;5393.541548968382;5411.675299482044;5442.047641662693;5454.509094181463;5462.481064298885;4291.914161716748;4418.955810441855;4911.877203069952;5032.043911656773;5080.085584594808;3752.137008488063;3851.5763266040713;3863.864764733221;3892.805359732002;3932.8623498178;1156.8496095507699;1160.1762748448696;1167.7489339791985;1180.350807056133;1184.8281999110081;896.66375109334;945.0266225787312;951.3388195204404;965.1362030982232;983.2527279267808;5962.2249107615735;5988.191594134823;6025.548083893726;6059.818205453844;6154.7230374633245;463.45543985816533;489.7012822178468;491.2729160841974;491.574787808543;496.91552436085954;4053.148838743838;4125.484314460692;4158.147579746144;4162.313218318944;4180.665546756252;11076.889231107747;11351.148663850245;11417.31496110236;11431.657050288504;11498.022668073307;11101.44753678815;11130.666080017612;11323.547058117583;11413.144014198968;11416.257943233662;7978.6808527659405;8229.670813167526;8232.34141268697;8306.127856574973;8412.242898139197;6053.152558641706;6213.689315534296;6269.96865015672;6322.652254126067;6355.90466142999;10283.742906427398;10460.424676642857;10481.580736770444;10595.94702026485;10710.250282480152;10128.696139115838;10426.478676066015;10471.21465890046;10570.365778053341;10632.84050739255;6664.433523150393;6891.896621550581;7518.736844210426;8089.47418417801;8137.715179968909;8123.8781418277595;8280.00639923213;8355.039170495227;8363.289120424832;8407.201315874981;7219.819504512219;7227.7831665050135;7282.0533330668795;7428.294312040348;7591.620418978919;7241.674124664508;7273.272672732684;7334.559926404433;7372.852542949004;7545.132309784225;6461.57999730016;6512.05575191604;6513.413792758674;6552.705128269144;6577.375149360803;5045.8738531537;5053.317802096817;5082;5136.8715782104255;5148.897022059463;4778.116048531033;4912.582430493448;4983.978284451606;5000.924986125284;5105.948940510547 06:08:35 INFO - PROCESS | 30202 | |4;prototype.html;321.6510086556087;325.58650513847414;334.6870675918017;336.63138862945067;338.4702939899056;5342.946570534294;5448.649080815299;5497.158451918607;5530.723463826813;5556.333240011194;5433.809816656418;5474.698891560973;5498.752556134974;5507.218854478493;5513.9448605513935;4277.764722940237;4286.371178951994;4292.6907293275535;4295.935560966588;4349.456317960255;4207.978960105195;4233.477309034963;4245.893852653678;4246.617804397603;4297.39836422901;4234.21666991606;4235.343521754117;4247.409080460917;4251.192273468047;4254.127903779718;4191.664666826662;4204.432401625802;4276.3799249109015;4279.636230920375;4282.308488147196;3755.4366844973474;3756.398976163828;3763.6236376362417;3765.265773174232;3775.0751065989007;5015.949840501585;5281.63028587999;5294.655847369909;5298.231756395301;5305.575553955674;4788.138135135709;4793.712377257376;4815.73660379621;4821.204501257288;4837.8306759263605;5371.409144994048;5685.630434021817;5686.175504551817;5691.26013618227;5708.315002199763;3932.390479475686;3976.8608098716695;3979.522457305142;3982.3628219484744;3996;5944.375840536768;5975;6009.819705408845;6014.51883849291;6025.698715064229;4032.5967403259438;4196.559361267084;4197.097624010852;4199.984007676332;4210.15796840627;4175.331946888544;4185.497740271187;4187.685923555685;4192.972721683207;4193.1404062167185;4827.541383568626;4840.2255639097575;4841.95158048415;4858.708477491362;4868.269759536098;5633.549316054706;5758.481736643722;5768.74040668171;5784.611693193603;5858.150568167592;1414.5685565902293;1447.5307562823743;1453.8982271241123;1454.2365258239508;1456.8709250330867;889.2796834564024;898.5237823953315;912.6988093928987;919.4966230213649;926.9351145419756;4809.44691360498;4847.103285892122;4849.2726091085915;4887.584555312767;4903.289023091703;5180.84457466269;5184.455632158644;5222.529972302435;5276.762545685377;5284.603654725834;4696.825793551612;4875.000624871893;4907.263910413467;4936;5022.4977502249485;2727.8499682517654;2741.3283745482486;2745.8215216010894;2750.3124218945263;2750.7936904731823;5304.469553044742;5337.5463085637375;5341.198820177005;5370.543503802142;5382.004329199032;4925.532074452921;5234.528892399702;5234.685918844882;5239.816606418757;5296.470352964673;5237.476252374732;5303.522682958553;5321.707306098125;5335.386430560535;5344.652597581145;5129.076426436895;5153.325169320061;5157.406898206755;5190.922136167885;5203.323567936144;4722.787474563722;5016.563653897092;5023.824166154167;5056.216286475602;5165.896682066263;5270.183121616155;5286.9471305288;5328.333958255218;5332.626716129989;5335.386430560535;3786.905327366838;3949.84200631983;4152.709310348247;4172.5173521754505;4179.6029377209115;5799.840031993703;5800.6809625471005;5900.232969714081;5931.525477961839;5941.554383421174;5660.462256085665;5799.246098007232;5808.332041815076;5843.181954526454;5846.239988801429;5698.287714035746;5729.590893418409;5750.511206547323;5756.971215143897;5766.3080430346945;5702.175303902877;5729.169270455677;5741.1388291756575;5758.193852860519;5781;5545.500904918576;5734.283214598176;5738.340090889601;5774.220480235114;5863.384344643751;5605.663660180402;5608.943910560843;5633.3521645009705;5652.152177173457;5693.430656934273 06:08:35 INFO - PROCESS | 30202 | |5;yui.html;737.4469148138896;743.5018537579821;768.8769796832506;804.3806269172734;804.4971892567146;13544.525941592046;14853;14879.553613391601;14888.776668349983;14899.5530134096;13681;13758.518451854186;13777.448902043907;13788.517401890937;13809.24049177295;651.605778504003;658.6377492379196;770.299027884625;776.316841179761;785.4933567848719;803.6102490292203;812.4312980913385;814.0516298512226;814.1776805426503;815.7797394703426;864.3301441382947;864.5633954852791;868.2012548455405;869.5261082709939;870.1776820904248;853.9837593263996;856.6273670953124;857.7383897911135;858.9957050214709;859.6002858670716;620;628.915096461981;629.7229219143608;630.4609558827228;632.0771673356904;13547.051706380556;13562.728745425036;13564.796528052088;13600.863991360058;13619.931900340534;14702.26488675562;14769.926150369287;14866.776998345034;14928.701425971529;14987.400503979938;11159.158738808086;11348.489317980711;11722.88277117235;11947.761044779056;12038.217515861441;3648.5074514940407;3743.9438408423894;3835.884923452301;3876.2635099331037;3905.687544996422;87110.56444717736;89191;89544.99999999935;90009;90711.54644226802;11743.47154378055;11751.47118379675;11830.94084529589;11926.224795388272;12014.459349329301;23427.297181084596;23615.527689446113;23619.40951476227;23700.288991330286;23821.404464888168;7867.409944254089;7898.9210107899335;8012.759617211493;8129.349652027823;8288.461250018729;4602.470715867718;4666.906661866744;4669.39297891272;4685.156671799041;4773.832915847928;3230.3700778347998;3311.850966706504;3312.966870331266;3335.232896433834;3394.304167645627;552.078029690418;554.9899183486017;569.900267453194;577.9797707080317;585.3151812379526;685.9965700171567;689.3933338661946;729.7336472187613;743.4758495260828;755.6486233901153;9621.470819105016;9728.610855565697;9756.707298780906;10121.898781012243;10161.307253577808;704.2112833626371;711.8540699156661;718.6514540447879;733.4425836364402;757.708282311303;4568.840090596813;4706.411698537683;4901.754912254373;4963.851084467472;4965.453800081988;128308;129589;132738;133152;137285;91702;93473.5326323364;93824.53087734518;105846.47076764567;106637.46681266699;77570;78258.60870695724;78645;86277.56861215654;87300.56349718211;9519.952400237955;10057;10128.594856205964;10204.540795664065;10378.325408848401;49170.75414622904;50580.24129637985;50900.236496453326;51230.487695124066;53119.20321195263;67911.19021312612;68317.09402136762;74033;74180;77755.2224477748;11702.590409335633;12102.93948530287;12250.632481025583;12310.26138431697;14019.50931717385;13842.584722458343;14088.78866816978;14797.260136992893;15214.695706086037;15275.61810954735;14099.929500352842;14193.361298741787;14195.503157389441;14363.784543231652;15004.249787510798;13666.385012674255;13901.443942242196;14238.501652442115;15083.170425626697;15247.313870875616;13865.653358666113;14013.229272390117;14302.427902883768;14682.265886705409;14768.33542490569;11235.382053987109;11694.122940779305;11807.291562506278;12057.698557536132;12195.939020304842;10725.624603139166;11985.161038727205;12014.459349329127;12150.513979440724;12265.141440099107 06:08:35 INFO - PROCESS | 30202 | __end_tp_report 06:08:35 INFO - PROCESS | 30202 | __start_cc_report 06:08:35 INFO - PROCESS | 30202 | _x_x_mozilla_cycle_collect,297 06:08:35 INFO - PROCESS | 30202 | __end_cc_report 06:08:35 INFO - PROCESS | 30202 | __startTimestamp1474463315484__endTimestamp 06:08:35 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | ------- Summary: start ------- 06:08:35 INFO - PROCESS | 30202 | Number of tests: 6 06:08:35 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | [#0] dojo.html Cycles:165 Average:5296.55 Median:5492.59 stddev:587.77 (10.7%) stddev-sans-first:562.75 06:08:35 INFO - PROCESS | 30202 | Values: 3058.8 3058.9 3066.7 3096.5 3113.3 5165.8 5332.2 5346.8 5358.7 5445.9 5229.4 5346.3 5362.3 5381.1 5407.8 4890.2 4918.9 4924.5 4925.3 4990.3 4907.8 4949.3 5007.3 5018.7 5021.4 4680.9 4741.4 4817.5 4851.8 4967.8 4888.8 4892.4 4925.1 4928.6 4943.4 4820.8 4867.4 4869.8 4890.0 4922.7 5061.0 5145.5 5279.8 5316.1 5356.0 5715.2 5739.4 5744.4 5746.7 5792.9 5766.9 5778.6 5780.8 5783.9 5794.9 5164.9 5213.7 5332.4 5335.7 5389.4 5798.8 5892.7 5900.2 5956.0 5961.6 5651.4 5657.3 5665.9 5667.7 5674.9 5401.7 5406.4 5679.7 5714.4 5714.9 5451.5 5488.2 5493.6 5496.1 5497.0 5520.2 5521.4 5525.4 5677.8 5707.1 4441.8 4445.4 4475.8 4491.0 4499.9 3927.7 3951.5 3954.8 3962.2 3998.4 5261.4 5278.4 5350.4 5463.5 5558.7 5574.2 5655.7 5672.7 5704.7 5709.9 5357.2 5363.8 5371.8 5381.3 5417.9 4765.2 4860.9 4886.4 4937.2 4973.1 5820.9 5824.4 5848.4 5854.9 5866.1 5653.5 5655.1 5664.6 5667.6 5679.2 5946.9 5975.9 5980.3 6077.4 6105.7 5649.0 5701.9 5702.5 5702.8 5709.3 5501.8 5558.3 5804.6 5815.1 5822.5 5498.3 5541.9 5569.6 5582.9 5649.9 5567.4 5567.9 5570.5 5572.2 5580.7 5340.4 5501.0 5509.6 5514.4 5569.8 5392.2 5439.6 5522.5 5534.1 5553.2 5249.2 5492.6 5502.3 5561.9 5572.4 06:08:35 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | [#1] ext.html Cycles:180 Average:60808.59 Median:41643.58 stddev:123630.29 (296.9%) stddev-sans-first:123894.39 06:08:35 INFO - PROCESS | 30202 | Values: 575.6 580.4 584.3 586.3 593.7 41444.8 43654.6 43846.8 47236.0 47330.8 44915.8 45174.3 45403.8 45404.0 45578.0 8856.4 8999.6 9002.5 9009.6 9023.3 8795.8 8796.5 8880.2 8902.0 8914.8 8843.1 8848.6 8872.6 8876.0 8928.0 8780.6 8845.1 8854.6 8862.2 8921.1 8574.2 8675.3 8679.2 8705.3 8754.3 41842.4 41962.8 42403.8 42468.8 42485.0 3505.7 3593.3 3607.2 3620.0 3675.6 31800.4 32245.8 32263.4 32444.0 32453.7 4374.3 4447.4 4574.8 4636.2 4648.2 348718.0 353060.0 354088.0 354299.0 354482.0 55390.4 55472.0 55677.7 55751.7 56236.0 35491.6 36177.0 36477.3 37958.6 38050.0 16498.9 16558.1 16656.7 16667.7 16741.9 12694.4 12842.1 12906.7 12924.4 12926.4 18814.0 18902.6 18985.6 19041.6 19069.6 6902.6 7014.9 7114.9 7165.8 7278.8 918.0 989.7 1003.5 1004.4 1043.1 31993.0 32010.8 32203.7 32235.4 32381.0 972.0 1090.2 1096.7 1110.7 1164.3 14983.9 16276.3 16295.9 16421.3 16445.5 545362.0 554028.0 554143.0 554266.0 554625.0 56240.4 56249.7 56358.7 56368.0 56602.2 1320.1 1345.5 1404.0 1409.5 1417.1 29502.9 30251.4 30620.4 30943.4 31329.5 48650.5 48952.5 49197.5 49236.3 49256.3 464440.0 467187.0 468913.0 471795.0 472640.0 27629.4 27900.0 28292.2 28394.3 28398.4 46478.5 46967.3 47162.5 47683.5 48673.5 39968.2 40742.2 40761.8 40921.2 42103.4 38720.2 38962.4 39521.0 40164.2 41266.0 39916.4 39966.4 40708.2 40849.4 44348.6 31002.0 36204.0 37031.6 37772.0 38516.2 27401.2 27972.7 28363.7 28412.4 28477.9 06:08:35 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | [#2] jquery.html Cycles:180 Average:28184.15 Median:21744.88 stddev:77854.00 (358.0%) stddev-sans-first:78044.43 06:08:35 INFO - PROCESS | 30202 | Values: 391.8 395.2 405.9 407.1 412.8 14719.8 18559.7 19235.3 20094.0 20183.5 18862.4 19257.6 19383.8 19421.8 19494.2 5547.4 5592.2 5731.9 5750.6 5754.6 5664.5 5751.2 5775.2 5778.1 5786.9 5506.7 5675.9 5681.8 5693.1 5706.4 5402.9 5647.5 5655.2 5672.6 5682.3 5444.8 5555.8 5606.2 5616.9 5640.6 12808.9 12948.5 20683.2 21251.1 21476.7 2427.6 2430.4 2433.9 2437.8 2864.6 9227.4 9476.5 9649.0 9800.4 10143.1 1879.5 1940.9 1951.2 1968.5 2010.7 80182.6 85438.0 87622.0 88292.6 89794.6 10051.9 10377.7 10594.1 10881.0 10898.9 12396.3 13115.1 14702.1 14729.3 14737.9 7589.6 7794.8 7824.7 7957.6 8136.3 7692.8 7736.7 7787.7 7954.6 7980.2 3872.7 3987.4 4101.2 4105.9 4205.8 1914.5 1915.1 1926.3 1934.3 1978.9 896.5 909.8 956.7 965.4 1082.1 18185.8 18535.2 18822.5 18977.2 19390.4 976.3 981.9 995.4 998.1 1038.5 10117.6 10562.9 10615.8 10640.3 10667.6 439458.0 468492.0 480010.0 480813.0 481576.0 91036.5 92486.0 93992.0 94979.5 95461.0 975.8 986.5 1045.2 1045.4 1068.2 16102.5 16699.4 17145.1 17180.9 17260.1 30294.0 39502.4 41497.0 41968.0 42516.6 54933.7 55764.0 57382.1 58053.7 59003.0 7016.9 7390.0 8239.5 8282.7 8517.7 11260.4 12503.5 12762.6 13148.4 13206.9 11273.0 11273.3 11471.6 11644.5 12022.8 11218.9 11228.8 11408.3 11563.8 11633.8 11651.9 11773.5 11788.2 11873.9 12181.7 7372.6 7538.5 7587.7 7745.4 8065.4 11186.7 11607.6 11948.8 12043.9 12101.9 06:08:35 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | [#3] mootools.html Cycles:180 Average:5818.26 Median:491.42 stddev:3344.57 (680.6%) stddev-sans-first:3337.75 06:08:35 INFO - PROCESS | 30202 | Values: 1437.1 1479.6 1612.8 1654.2 1711.1 7417.6 7716.6 8446.5 9127.2 9130.5 8498.8 8787.5 8795.0 9015.2 9024.4 2404.5 2436.4 2437.1 2456.5 2464.3 2377.2 2400.4 2423.1 2435.1 2435.3 2417.7 2420.5 2452.3 2471.8 2478.3 2308.4 2318.0 2320.7 2331.0 2353.0 2325.5 2346.5 2353.2 2353.2 2365.6 8818.4 9047.5 9087.4 9164.9 9166.9 5428.9 5557.9 5563.7 5596.5 5604.2 3470.6 3498.8 3508.8 3519.9 3584.2 1153.5 1176.9 1206.8 1229.1 2179.0 12615.4 12637.9 12655.4 12717.9 12739.0 4690.1 4691.8 4741.1 4757.2 4817.7 9815.0 9840.7 9870.8 9887.1 9909.6 5393.5 5411.7 5442.0 5454.5 5462.5 4291.9 4419.0 4911.9 5032.0 5080.1 3752.1 3851.6 3863.9 3892.8 3932.9 1156.8 1160.2 1167.7 1180.4 1184.8 896.7 945.0 951.3 965.1 983.3 5962.2 5988.2 6025.5 6059.8 6154.7 463.5 489.7 491.3 491.6 496.9 4053.1 4125.5 4158.1 4162.3 4180.7 11076.9 11351.1 11417.3 11431.7 11498.0 11101.4 11130.7 11323.5 11413.1 11416.3 7978.7 8229.7 8232.3 8306.1 8412.2 6053.2 6213.7 6270.0 6322.7 6355.9 10283.7 10460.4 10481.6 10595.9 10710.3 10128.7 10426.5 10471.2 10570.4 10632.8 6664.4 6891.9 7518.7 8089.5 8137.7 8123.9 8280.0 8355.0 8363.3 8407.2 7219.8 7227.8 7282.1 7428.3 7591.6 7241.7 7273.3 7334.6 7372.9 7545.1 6461.6 6512.1 6513.4 6552.7 6577.4 5045.9 5053.3 5082.0 5136.9 5148.9 4778.1 4912.6 4984.0 5000.9 5105.9 06:08:35 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | [#4] prototype.html Cycles:180 Average:4629.46 Median:5182.65 stddev:1346.84 (26.0%) stddev-sans-first:1311.24 06:08:35 INFO - PROCESS | 30202 | Values: 321.7 325.6 334.7 336.6 338.5 5342.9 5448.6 5497.2 5530.7 5556.3 5433.8 5474.7 5498.8 5507.2 5513.9 4277.8 4286.4 4292.7 4295.9 4349.5 4208.0 4233.5 4245.9 4246.6 4297.4 4234.2 4235.3 4247.4 4251.2 4254.1 4191.7 4204.4 4276.4 4279.6 4282.3 3755.4 3756.4 3763.6 3765.3 3775.1 5015.9 5281.6 5294.7 5298.2 5305.6 4788.1 4793.7 4815.7 4821.2 4837.8 5371.4 5685.6 5686.2 5691.3 5708.3 3932.4 3976.9 3979.5 3982.4 3996.0 5944.4 5975.0 6009.8 6014.5 6025.7 4032.6 4196.6 4197.1 4200.0 4210.2 4175.3 4185.5 4187.7 4193.0 4193.1 4827.5 4840.2 4842.0 4858.7 4868.3 5633.5 5758.5 5768.7 5784.6 5858.2 1414.6 1447.5 1453.9 1454.2 1456.9 889.3 898.5 912.7 919.5 926.9 4809.4 4847.1 4849.3 4887.6 4903.3 5180.8 5184.5 5222.5 5276.8 5284.6 4696.8 4875.0 4907.3 4936.0 5022.5 2727.8 2741.3 2745.8 2750.3 2750.8 5304.5 5337.5 5341.2 5370.5 5382.0 4925.5 5234.5 5234.7 5239.8 5296.5 5237.5 5303.5 5321.7 5335.4 5344.7 5129.1 5153.3 5157.4 5190.9 5203.3 4722.8 5016.6 5023.8 5056.2 5165.9 5270.2 5286.9 5328.3 5332.6 5335.4 3786.9 3949.8 4152.7 4172.5 4179.6 5799.8 5800.7 5900.2 5931.5 5941.6 5660.5 5799.2 5808.3 5843.2 5846.2 5698.3 5729.6 5750.5 5757.0 5766.3 5702.2 5729.2 5741.1 5758.2 5781.0 5545.5 5734.3 5738.3 5774.2 5863.4 5605.7 5608.9 5633.4 5652.2 5693.4 06:08:35 INFO - PROCESS | 30202 | 06:08:35 INFO - PROCESS | 30202 | [#5] yui.html Cycles:180 Average:21498.90 Median:3856.07 stddev:31856.28 (826.1%) stddev-sans-first:31907.50 06:08:35 INFO - PROCESS | 30202 | Values: 737.4 743.5 768.9 804.4 804.5 13544.5 14853.0 14879.6 14888.8 14899.6 13681.0 13758.5 13777.4 13788.5 13809.2 651.6 658.6 770.3 776.3 785.5 803.6 812.4 814.1 814.2 815.8 864.3 864.6 868.2 869.5 870.2 854.0 856.6 857.7 859.0 859.6 620.0 628.9 629.7 630.5 632.1 13547.1 13562.7 13564.8 13600.9 13619.9 14702.3 14769.9 14866.8 14928.7 14987.4 11159.2 11348.5 11722.9 11947.8 12038.2 3648.5 3743.9 3835.9 3876.3 3905.7 87110.6 89191.0 89545.0 90009.0 90711.5 11743.5 11751.5 11830.9 11926.2 12014.5 23427.3 23615.5 23619.4 23700.3 23821.4 7867.4 7898.9 8012.8 8129.3 8288.5 4602.5 4666.9 4669.4 4685.2 4773.8 3230.4 3311.9 3313.0 3335.2 3394.3 552.1 555.0 569.9 578.0 585.3 686.0 689.4 729.7 743.5 755.6 9621.5 9728.6 9756.7 10121.9 10161.3 704.2 711.9 718.7 733.4 757.7 4568.8 4706.4 4901.8 4963.9 4965.5 128308.0 129589.0 132738.0 133152.0 137285.0 91702.0 93473.5 93824.5 105846.5 106637.5 77570.0 78258.6 78645.0 86277.6 87300.6 9520.0 10057.0 10128.6 10204.5 10378.3 49170.8 50580.2 50900.2 51230.5 53119.2 67911.2 68317.1 74033.0 74180.0 77755.2 11702.6 12102.9 12250.6 12310.3 14019.5 13842.6 14088.8 14797.3 15214.7 15275.6 14099.9 14193.4 14195.5 14363.8 15004.2 13666.4 13901.4 14238.5 15083.2 15247.3 13865.7 14013.2 14302.4 14682.3 14768.3 11235.4 11694.1 11807.3 12057.7 12195.9 10725.6 11985.2 12014.5 12150.5 12265.1 06:08:35 INFO - PROCESS | 30202 | -------- Summary: end -------- 06:08:35 INFO - PROCESS | 30202 | 06:08:36 INFO - TEST-INFO | 30202: exit 0 06:08:36 INFO - TEST-OK | dromaeo_css | took 1114641ms 06:08:36 INFO - TEST-START | kraken 06:08:36 INFO - operating with platform_type : linux_ 06:08:36 INFO - Initialising browser for kraken test... 06:08:36 INFO - TEST-INFO | started process 30553 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbY8dW2/profile http://localhost:58219/getInfo.html) 06:08:41 INFO - PROCESS | 30553 | __metrics Screen width/height:1600/1200 06:08:41 INFO - PROCESS | 30553 | colorDepth:24 06:08:41 INFO - PROCESS | 30553 | Browser inner width/height: 1024/697 06:08:41 INFO - PROCESS | 30553 | __metrics 06:08:41 ERROR - PROCESS | 30553 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3018: TypeError: this.tabs is undefined 06:08:42 INFO - TEST-INFO | 30553: exit 0 06:08:42 INFO - Browser initialized. 06:08:42 INFO - Running cycle 1/1 for kraken test... 06:08:42 INFO - TEST-INFO | started process 30674 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbY8dW2/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:08:54 INFO - PROCESS | 30674 | RSS: Main: 185278464 06:08:54 INFO - PROCESS | 30674 | 06:08:57 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58219/tests/kraken/driver.html?testName=audio-beat-detection) 06:08:58 INFO - PROCESS | 30674 | RSS: Main: 199118848 06:08:58 INFO - PROCESS | 30674 | 06:09:01 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58219/tests/kraken/driver.html?testName=audio-dft) 06:09:01 INFO - PROCESS | 30674 | RSS: Main: 197054464 06:09:01 INFO - PROCESS | 30674 | 06:09:04 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58219/tests/kraken/driver.html?testName=audio-fft) 06:09:05 INFO - PROCESS | 30674 | RSS: Main: 192315392 06:09:05 INFO - PROCESS | 30674 | 06:09:07 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58219/tests/kraken/driver.html?testName=audio-oscillator) 06:09:07 INFO - PROCESS | 30674 | RSS: Main: 192872448 06:09:07 INFO - PROCESS | 30674 | 06:09:10 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58219/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:09:10 INFO - PROCESS | 30674 | RSS: Main: 193146880 06:09:10 INFO - PROCESS | 30674 | 06:09:13 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58219/tests/kraken/driver.html?testName=imaging-darkroom) 06:09:14 INFO - PROCESS | 30674 | RSS: Main: 193400832 06:09:14 INFO - PROCESS | 30674 | 06:09:17 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58219/tests/kraken/driver.html?testName=imaging-desaturate) 06:09:18 INFO - PROCESS | 30674 | RSS: Main: 191766528 06:09:18 INFO - PROCESS | 30674 | 06:09:21 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58219/tests/kraken/driver.html?testName=json-parse-financial) 06:09:22 INFO - PROCESS | 30674 | RSS: Main: 192716800 06:09:22 INFO - PROCESS | 30674 | 06:09:23 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58219/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:09:24 INFO - PROCESS | 30674 | RSS: Main: 193134592 06:09:24 INFO - PROCESS | 30674 | 06:09:26 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58219/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:09:26 INFO - PROCESS | 30674 | RSS: Main: 193253376 06:09:26 INFO - PROCESS | 30674 | 06:09:28 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58219/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:09:29 INFO - PROCESS | 30674 | RSS: Main: 193314816 06:09:29 INFO - PROCESS | 30674 | 06:09:32 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58219/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:09:32 INFO - PROCESS | 30674 | RSS: Main: 193310720 06:09:32 INFO - PROCESS | 30674 | 06:09:35 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58219/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:09:36 INFO - PROCESS | 30674 | RSS: Main: 193474560 06:09:36 INFO - PROCESS | 30674 | 06:09:37 INFO - PROCESS | 30674 | Cycle 1(1): loaded http://localhost:58219/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58219/tests/kraken/driver.html?testName=ai-astar) 06:09:38 INFO - PROCESS | 30674 | RSS: Main: 195432448 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | __start_tp_report 06:09:38 INFO - PROCESS | 30674 | _x_x_mozilla_page_load 06:09:38 INFO - PROCESS | 30674 | _x_x_mozilla_page_load_details 06:09:38 INFO - PROCESS | 30674 | |i|pagename|runs| 06:09:38 INFO - PROCESS | 30674 | |0;ai-astar;115;116;115;113;113;117;113;114;112;112 06:09:38 INFO - PROCESS | 30674 | |1;audio-beat-detection;158;121;120;167;122;121;125;120;165;122 06:09:38 INFO - PROCESS | 30674 | |2;audio-dft;165;165;170;168;167;166;168;166;165;165 06:09:38 INFO - PROCESS | 30674 | |3;audio-fft;76;79;80;118;79;77;77;78;102;79 06:09:38 INFO - PROCESS | 30674 | |4;audio-oscillator;85;83;129;84;84;83;100;83;83;121 06:09:38 INFO - PROCESS | 30674 | |5;imaging-gaussian-blur;118;119;117;118;118;118;117;119;119;118 06:09:38 INFO - PROCESS | 30674 | |6;imaging-darkroom;149;152;150;149;152;148;150;151;149;149 06:09:38 INFO - PROCESS | 30674 | |7;imaging-desaturate;99;99;96;97;96;96;96;96;95;98 06:09:38 INFO - PROCESS | 30674 | |8;json-parse-financial;51;52;52;52;52;55;54;53;54;54 06:09:38 INFO - PROCESS | 30674 | |9;json-stringify-tinderbox;61;62;61;60;66;61;62;62;61;61 06:09:38 INFO - PROCESS | 30674 | |10;stanford-crypto-aes;84;77;82;81;80;80;80;83;79;88 06:09:38 INFO - PROCESS | 30674 | |11;stanford-crypto-ccm;143;133;128;129;125;129;131;144;180;126 06:09:38 INFO - PROCESS | 30674 | |12;stanford-crypto-pbkdf2;166;170;170;173;165;165;165;166;173;171 06:09:38 INFO - PROCESS | 30674 | |13;stanford-crypto-sha256-iterative;66;66;67;67;68;65;65;65;64;64 06:09:38 INFO - PROCESS | 30674 | __end_tp_report 06:09:38 INFO - PROCESS | 30674 | __start_cc_report 06:09:38 INFO - PROCESS | 30674 | _x_x_mozilla_cycle_collect,759 06:09:38 INFO - PROCESS | 30674 | __end_cc_report 06:09:38 INFO - PROCESS | 30674 | __startTimestamp1474463378238__endTimestamp 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | ------- Summary: start ------- 06:09:38 INFO - PROCESS | 30674 | Number of tests: 14 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#0] ai-astar Cycles:10 Average:114.00 Median:114.50 stddev:1.70 (1.5%) stddev-sans-first:1.76 06:09:38 INFO - PROCESS | 30674 | Values: 115.0 116.0 115.0 113.0 113.0 117.0 113.0 114.0 112.0 112.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#1] audio-beat-detection Cycles:10 Average:134.10 Median:123.50 stddev:20.34 (16.5%) stddev-sans-first:19.65 06:09:38 INFO - PROCESS | 30674 | Values: 158.0 121.0 120.0 167.0 122.0 121.0 125.0 120.0 165.0 122.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#2] audio-dft Cycles:10 Average:166.50 Median:166.50 stddev:1.72 (1.0%) stddev-sans-first:1.73 06:09:38 INFO - PROCESS | 30674 | Values: 165.0 165.0 170.0 168.0 167.0 166.0 168.0 166.0 165.0 165.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#3] audio-fft Cycles:10 Average:84.50 Median:78.50 stddev:14.01 (17.8%) stddev-sans-first:14.52 06:09:38 INFO - PROCESS | 30674 | Values: 76.0 79.0 80.0 118.0 79.0 77.0 77.0 78.0 102.0 79.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#4] audio-oscillator Cycles:10 Average:93.50 Median:83.00 stddev:17.49 (21.1%) stddev-sans-first:18.28 06:09:38 INFO - PROCESS | 30674 | Values: 85.0 83.0 129.0 84.0 84.0 83.0 100.0 83.0 83.0 121.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#5] imaging-gaussian-blur Cycles:10 Average:118.10 Median:118.00 stddev:0.74 (0.6%) stddev-sans-first:0.78 06:09:38 INFO - PROCESS | 30674 | Values: 118.0 119.0 117.0 118.0 118.0 118.0 117.0 119.0 119.0 118.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#6] imaging-darkroom Cycles:10 Average:149.90 Median:150.00 stddev:1.37 (0.9%) stddev-sans-first:1.41 06:09:38 INFO - PROCESS | 30674 | Values: 149.0 152.0 150.0 149.0 152.0 148.0 150.0 151.0 149.0 149.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#7] imaging-desaturate Cycles:10 Average:96.80 Median:96.50 stddev:1.40 (1.4%) stddev-sans-first:1.24 06:09:38 INFO - PROCESS | 30674 | Values: 99.0 99.0 96.0 97.0 96.0 96.0 96.0 96.0 95.0 98.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#8] json-parse-financial Cycles:10 Average:52.90 Median:53.50 stddev:1.29 (2.4%) stddev-sans-first:1.17 06:09:38 INFO - PROCESS | 30674 | Values: 51.0 52.0 52.0 52.0 52.0 55.0 54.0 53.0 54.0 54.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#9] json-stringify-tinderbox Cycles:10 Average:61.70 Median:61.50 stddev:1.64 (2.7%) stddev-sans-first:1.72 06:09:38 INFO - PROCESS | 30674 | Values: 61.0 62.0 61.0 60.0 66.0 61.0 62.0 62.0 61.0 61.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#10] stanford-crypto-aes Cycles:10 Average:81.40 Median:81.50 stddev:3.06 (3.8%) stddev-sans-first:3.10 06:09:38 INFO - PROCESS | 30674 | Values: 84.0 77.0 82.0 81.0 80.0 80.0 80.0 83.0 79.0 88.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#11] stanford-crypto-ccm Cycles:10 Average:136.80 Median:132.00 stddev:16.53 (12.5%) stddev-sans-first:17.38 06:09:38 INFO - PROCESS | 30674 | Values: 143.0 133.0 128.0 129.0 125.0 129.0 131.0 144.0 180.0 126.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:168.40 Median:170.00 stddev:3.34 (2.0%) stddev-sans-first:3.43 06:09:38 INFO - PROCESS | 30674 | Values: 166.0 170.0 170.0 173.0 165.0 165.0 165.0 166.0 173.0 171.0 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.70 Median:66.00 stddev:1.34 (2.0%) stddev-sans-first:1.41 06:09:38 INFO - PROCESS | 30674 | Values: 66.0 66.0 67.0 67.0 68.0 65.0 65.0 65.0 64.0 64.0 06:09:38 INFO - PROCESS | 30674 | -------- Summary: end -------- 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | ###!!! [Parent][OnMaybeDequeueOne] Error: Channel error: cannot send/recv 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | ###!!! [Parent][OnMaybeDequeueOne] Error: Channel error: cannot send/recv 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | ###!!! [Parent][OnMaybeDequeueOne] Error: Channel error: cannot send/recv 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | ###!!! [Parent][MessageChannel] Error: (msgtype=0x2000C,name=PAPZ::Msg_Destroy) Channel error: cannot send/recv 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | 06:09:38 INFO - PROCESS | 30674 | ###!!! [Parent][OnMaybeDequeueOne] Error: Channel error: cannot send/recv 06:09:38 INFO - PROCESS | 30674 | 06:09:39 INFO - TEST-INFO | 30674: exit 0 06:09:39 INFO - TEST-OK | kraken | took 62889ms 06:09:39 INFO - SUITE-END | took 1177s 06:09:39 INFO - Completed test suite (00:19:37) 06:09:39 INFO - javascript benchmark 06:09:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7177.69969575176, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3058.785884988051, 3058.9388212235754, 3066.7393271571914, 3096.520039393894, 3113.299507610789, 5165.81919632812, 5332.226827110072, 5346.786128554858, 5358.705271210082, 5445.945540544603, 5229.424763276046, 5346.251524786523, 5362.329708786402, 5381.0852155133625, 5407.756650950707, 4890.193118135512, 4918.893249018978, 4924.4583095859425, 4925.261210818388, 4990.326305948687, 4907.803687852482, 4949.257611358289, 5007.273945277951, 5018.673786203904, 5021.372328458942, 4680.906381872343, 4741.407324084489, 4817.470078291385, 4851.805927762885, 4967.751612419383, 4888.804447822083, 4892.363992680965, 4925.113479573675, 4928.6303527235605, 4943.357363542752, 4820.831270905536, 4867.367242258484, 4869.82955596556, 4889.975550122226, 4922.680025798311, 5061.0, 5145.485451454824, 5279.841604751864, 5316.149416093406, 5356.035913535562, 5715.171300161495, 5739.426057394227, 5744.396838331999, 5746.683932383718, 5792.8841423171725, 5766.942330576682, 5778.59549831512, 5780.797672081499, 5783.8554036149435, 5794.913076303858, 5164.870878228036, 5213.7393130343335, 5332.413434522199, 5335.679859208382, 5389.380221274525, 5798.797042103506, 5892.705364731746, 5900.232969713996, 5955.970220148958, 5961.582689211714, 5651.4348565143155, 5657.349404818498, 5665.858353541194, 5667.744951477193, 5674.921764864663, 5401.675899445967, 5406.378266499403, 5679.659220446786, 5714.371419143891, 5714.914276285859, 5451.509364157245, 5488.17677348401, 5493.587980901369, 5496.093144631171, 5497.038018346773, 5520.227168196456, 5521.365043020104, 5525.392206857243, 5677.829665110054, 5707.143928410772, 4441.7779111044965, 4445.355423463579, 4475.753833539186, 4491.034427598082, 4499.910001800011, 3927.66614837742, 3951.4863067801, 3954.762714237155, 3962.187751510933, 3998.4402183694306, 5261.447548007481, 5278.366596008504, 5350.438203988603, 5463.48096930791, 5558.694271815089, 5574.1917421973585, 5655.660660360391, 5672.659640421588, 5704.71476426177, 5709.914351284734, 5357.1696387060065, 5363.758630861621, 5371.75827087782, 5381.300430943952, 5417.864553386197, 4765.1660959331975, 4860.878478038077, 4886.364772579542, 4937.21004639256, 4973.055119527278, 5820.941790582125, 5824.417558244142, 5848.385919478478, 5854.853628659318, 5866.1494083357675, 5653.462921022497, 5655.123455864347, 5664.631798933056, 5667.631603945731, 5679.204911312502, 5946.910796337972, 5975.910361344497, 5980.3421623622235, 6077.392260773887, 6105.6947152641305, 5648.971755141198, 5701.942980570141, 5702.543796496353, 5702.828915132387, 5709.34342550612, 5501.752421140978, 5558.333000040021, 5804.564657650609, 5815.098659707752, 5822.475977162076, 5498.257735205696, 5541.889162216652, 5569.582281328835, 5582.86042848932, 5649.915251271316, 5567.415421380859, 5567.944320556742, 5570.470805273492, 5572.247746554325, 5580.665160090408, 5340.439253878442, 5500.972495137498, 5509.586780991522, 5514.393416724238, 5569.805056822992, 5392.245085688085, 5439.5920305976415, 5522.530584900329, 5534.086875665631, 5553.194786755978, 5249.2126181073145, 5492.588055895744, 5502.312210973629, 5561.860953476195, 5572.442755724395], "value": 5257.925137146971, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [575.6172145523227, 580.4021857486788, 584.2871696530232, 586.258383145321, 593.7239183779542, 41444.79277603611, 43654.56345436549, 43846.78076609616, 47236.0, 47330.76334618331, 44915.77542112293, 45174.32238516425, 45403.77298113505, 45404.0, 45578.0, 8856.424332418388, 8999.550022498848, 9002.504862232574, 9009.594568244445, 9023.323250756186, 8795.780105497382, 8796.516191609458, 8880.24517915978, 8902.0, 8914.821703565925, 8843.071477494866, 8848.5575721214, 8872.645094196225, 8876.0, 8927.95536022319, 8780.604872780741, 8845.115488451167, 8854.645814167425, 8862.15809498103, 8921.107889211093, 8574.22831945128, 8675.305975521944, 8679.17547832955, 8705.260052895512, 8754.299656027566, 41842.37236441456, 41962.8037196281, 42403.7879810599, 42468.78765606183, 42485.0, 3505.7370697197557, 3593.2993066352074, 3607.1703508193, 3619.963800361989, 3675.5773086095173, 31800.363992720246, 32245.838770805996, 32263.354732905445, 32444.0, 32453.6754632453, 4374.300111982099, 4447.444069491314, 4574.794134263966, 4636.211843986531, 4648.163975229765, 348718.0, 353060.0, 354088.0, 354299.0, 354482.0, 55390.44609553853, 55472.0, 55677.72161139168, 55751.72124139434, 56236.0, 35491.64508354935, 36177.0, 36477.27045459076, 37958.62041379551, 38050.0, 16498.917505412635, 16558.089305088335, 16656.6668666626, 16667.666646667, 16741.91629041847, 12694.42875070624, 12842.101052926393, 12906.67733306675, 12924.41840117197, 12926.353682315847, 18814.0, 18902.621947561245, 18985.620287594447, 19041.61916761657, 19069.61860762777, 6902.551334163263, 7014.894776578355, 7114.920653949353, 7165.820854478576, 7278.781636550912, 917.9816403671889, 989.7278248481581, 1003.5433877585681, 1004.3672486333563, 1043.1029314789275, 31993.0, 32010.839945800122, 32203.677963220067, 32235.35529289401, 32381.0, 971.9854202186973, 1090.1932569898377, 1096.6929259807266, 1110.7167672243527, 1164.3130552973787, 14983.925080374529, 16276.26756795947, 16295.859289849834, 16421.261043253082, 16445.506634800975, 545362.0, 554028.0, 554143.0, 554266.0, 554625.0, 56240.43759562434, 56249.7187514068, 56358.7182064087, 56368.0, 56602.15096773551, 1320.1155225998605, 1345.488714288564, 1403.9578812635636, 1409.5278081842698, 1417.0788987158223, 29502.852485737432, 30251.394972099995, 30620.387592248477, 30943.381132377675, 31329.53005704962, 48650.5134948646, 48952.51047489479, 49197.50802491929, 49236.2614560789, 49256.26115608197, 464440.0, 467187.0, 468913.0, 471795.0, 472640.0, 27629.447411052068, 27900.0, 28292.15123546297, 28394.290142746595, 28398.43203135967, 46478.53521464877, 46967.29549056835, 47162.52837471581, 47683.52316476929, 48673.513264868314, 39968.20063598653, 40742.1851562973, 40761.79619101885, 40921.1815763689, 42103.36844947267, 38720.2255954885, 38962.415563766, 39521.0, 40164.1967160661, 41266.0, 39916.40125398179, 39966.40050399304, 40708.1858362837, 40849.38725919173, 44348.556514434444, 31002.0, 36204.0, 37031.62968370282, 37772.0, 38516.229675405775, 27401.177964661092, 27972.72027279701, 28363.716362836934, 28412.431751364442, 28477.857610712643], "value": 19771.202287438493, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [391.82367934429516, 395.2371922190175, 405.86403554809135, 407.1287444867982, 412.83486605357854, 14719.779203311959, 18559.72160417593, 19235.326763563276, 20094.0, 20183.495412614673, 18862.43412697618, 19257.614847703073, 19383.806161938377, 19421.805781942177, 19494.22023119077, 5547.362053363874, 5592.245046918675, 5731.942680573183, 5750.597458177929, 5754.625949313281, 5664.490195882369, 5751.223584816059, 5775.191473193735, 5778.133280007991, 5786.884262314751, 5506.697131657757, 5675.858103547403, 5681.7727290908315, 5693.060644993571, 5706.3722990471015, 5402.864928376822, 5647.463490968393, 5655.179998900177, 5672.631278966875, 5682.261306030231, 5444.8366549003595, 5555.833325000256, 5606.187102870061, 5616.887662246773, 5640.605157638967, 12808.935955320258, 12948.54680086202, 20683.172673093057, 21251.149954001823, 21476.677849832264, 2427.635854621803, 2430.4045508850268, 2433.914812981537, 2437.7805997460314, 2864.627598412214, 9227.400218985744, 9476.478793666345, 9648.98685638012, 9800.411975281506, 10143.087122158968, 1879.5113270549618, 1940.9320673776492, 1951.1902560437402, 1968.4881930698123, 2010.7486564179478, 80182.59908700419, 85438.0, 87622.0, 88292.55853720754, 89794.55102724509, 10051.899481005243, 10377.740556485996, 10594.099501542456, 10881.0, 10898.945505272422, 12396.31820249895, 13115.147515411467, 14702.117872927658, 14729.337179826933, 14737.926310368379, 7589.58257295854, 7794.8051298716855, 7824.726134585376, 7957.641906114123, 8136.267735903797, 7692.7692169235015, 7736.729214477579, 7787.688492460238, 7954.642041108164, 7980.241877021674, 3872.6901847852105, 3987.362022076512, 4101.159262351211, 4105.85629502966, 4205.810738516774, 1914.5117994911209, 1915.1477592471217, 1926.3354142820704, 1934.303650685752, 1978.881267123977, 896.4755617963434, 909.8453262945183, 956.7273327101742, 965.4062751407974, 1082.0856376361962, 18185.818141818414, 18535.165917533745, 18822.529436763918, 18977.240910363707, 19390.4182874514, 976.3312131190157, 981.8723565936525, 995.3878364805593, 998.1266391907081, 1038.4755698372273, 10117.59529618807, 10562.894371056345, 10615.84076238857, 10640.308379955279, 10667.626633067805, 439458.0, 468492.0, 480010.0, 480813.0, 481576.0, 91036.54481727548, 92486.0, 93992.0, 94979.52510237404, 95461.0, 975.7755716185317, 986.4673076538733, 1045.2369770067894, 1045.3884477580548, 1068.1988508618535, 16102.516924492284, 16699.415520456725, 17145.142742863056, 17180.91409542944, 17260.12910177494, 30294.0, 39502.40746388749, 41497.0, 41968.0, 42516.57483425126, 54933.72533137309, 55764.0, 57382.13926791185, 58053.709731451076, 59003.0, 7016.929830701832, 7390.0, 8239.464434811718, 8282.71010514629, 8517.659293628185, 11260.380679062402, 12503.499860005499, 12762.61712148637, 13148.408321625358, 13206.867931320563, 11273.0, 11273.323600583992, 11471.598494052669, 11644.53421863116, 12022.75954480923, 11218.887811122111, 11228.831567526657, 11408.315501069963, 11563.826542602035, 11633.767324653629, 11651.941740291244, 11773.47019384147, 11788.23376480526, 11873.940630296793, 12181.69545761363, 7372.557646541225, 7538.547687138789, 7587.658555365132, 7745.380369570534, 8065.435419520577, 11186.664400068012, 11607.593734219261, 11948.76102477963, 12043.939780301393, 12101.878981210075], "value": 8964.205673087527, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1437.073087858331, 1479.6300924768807, 1612.7500237463198, 1654.239050036983, 1711.1358763824267, 7417.629118544065, 7716.614169291541, 8446.450980686259, 9127.178553930136, 9130.452172869624, 8498.830023399529, 8787.47275163489, 8794.95602521988, 9015.233705135055, 9024.368294219406, 2404.5070760494145, 2436.4030812450974, 2437.1348171399077, 2456.520978409211, 2464.297675162579, 2377.1561095811, 2400.435897564071, 2423.127674037354, 2435.135526887947, 2435.305937807725, 2417.6736140621056, 2420.467497150633, 2452.2520631207476, 2471.765182307678, 2478.2565230430887, 2308.4113551044543, 2318.0296747764432, 2320.663503791949, 2330.9650355244685, 2352.9764702352927, 2325.5232677301283, 2346.5424242272766, 2353.199912029918, 2353.223436266028, 2365.5924724788897, 8818.382713210078, 9047.457152570867, 9087.40931839435, 9164.8625270621, 9166.86249706255, 5428.9185662215095, 5557.861053473655, 5563.664720467059, 5596.524295434893, 5604.243427137325, 3470.6008808987035, 3498.807565583892, 3508.824558772051, 3519.9472007919903, 3584.175639602906, 1153.463639407671, 1176.9117316201318, 1206.849143857018, 1229.0966139887175, 2178.9891050544807, 12615.432305546272, 12637.873621263761, 12655.367231638473, 12717.936410317981, 12739.0, 4690.085433340534, 4691.835785747482, 4741.051789642016, 4757.167495688241, 4817.686850354716, 9815.0, 9840.65557705477, 9870.802583948425, 9887.110160085627, 9909.554070066864, 5393.541548968382, 5411.675299482044, 5442.047641662693, 5454.509094181463, 5462.481064298885, 4291.914161716748, 4418.955810441855, 4911.877203069952, 5032.043911656773, 5080.085584594808, 3752.137008488063, 3851.5763266040713, 3863.864764733221, 3892.805359732002, 3932.8623498178, 1156.8496095507699, 1160.1762748448696, 1167.7489339791985, 1180.350807056133, 1184.8281999110081, 896.66375109334, 945.0266225787312, 951.3388195204404, 965.1362030982232, 983.2527279267808, 5962.2249107615735, 5988.191594134823, 6025.548083893726, 6059.818205453844, 6154.7230374633245, 463.45543985816533, 489.7012822178468, 491.2729160841974, 491.574787808543, 496.91552436085954, 4053.148838743838, 4125.484314460692, 4158.147579746144, 4162.313218318944, 4180.665546756252, 11076.889231107747, 11351.148663850245, 11417.31496110236, 11431.657050288504, 11498.022668073307, 11101.44753678815, 11130.666080017612, 11323.547058117583, 11413.144014198968, 11416.257943233662, 7978.6808527659405, 8229.670813167526, 8232.34141268697, 8306.127856574973, 8412.242898139197, 6053.152558641706, 6213.689315534296, 6269.96865015672, 6322.652254126067, 6355.90466142999, 10283.742906427398, 10460.424676642857, 10481.580736770444, 10595.94702026485, 10710.250282480152, 10128.696139115838, 10426.478676066015, 10471.21465890046, 10570.365778053341, 10632.84050739255, 6664.433523150393, 6891.896621550581, 7518.736844210426, 8089.47418417801, 8137.715179968909, 8123.8781418277595, 8280.00639923213, 8355.039170495227, 8363.289120424832, 8407.201315874981, 7219.819504512219, 7227.7831665050135, 7282.0533330668795, 7428.294312040348, 7591.620418978919, 7241.674124664508, 7273.272672732684, 7334.559926404433, 7372.852542949004, 7545.132309784225, 6461.57999730016, 6512.05575191604, 6513.413792758674, 6552.705128269144, 6577.375149360803, 5045.8738531537, 5053.317802096817, 5082.0, 5136.8715782104255, 5148.897022059463, 4778.116048531033, 4912.582430493448, 4983.978284451606, 5000.924986125284, 5105.948940510547], "value": 4598.845090112946, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [321.6510086556087, 325.58650513847414, 334.6870675918017, 336.63138862945067, 338.4702939899056, 5342.946570534294, 5448.649080815299, 5497.158451918607, 5530.723463826813, 5556.333240011194, 5433.809816656418, 5474.698891560973, 5498.752556134974, 5507.218854478493, 5513.9448605513935, 4277.764722940237, 4286.371178951994, 4292.6907293275535, 4295.935560966588, 4349.456317960255, 4207.978960105195, 4233.477309034963, 4245.893852653678, 4246.617804397603, 4297.39836422901, 4234.21666991606, 4235.343521754117, 4247.409080460917, 4251.192273468047, 4254.127903779718, 4191.664666826662, 4204.432401625802, 4276.3799249109015, 4279.636230920375, 4282.308488147196, 3755.4366844973474, 3756.398976163828, 3763.6236376362417, 3765.265773174232, 3775.0751065989007, 5015.949840501585, 5281.63028587999, 5294.655847369909, 5298.231756395301, 5305.575553955674, 4788.138135135709, 4793.712377257376, 4815.73660379621, 4821.204501257288, 4837.8306759263605, 5371.409144994048, 5685.630434021817, 5686.175504551817, 5691.26013618227, 5708.315002199763, 3932.390479475686, 3976.8608098716695, 3979.522457305142, 3982.3628219484744, 3996.0, 5944.375840536768, 5975.0, 6009.819705408845, 6014.51883849291, 6025.698715064229, 4032.5967403259438, 4196.559361267084, 4197.097624010852, 4199.984007676332, 4210.15796840627, 4175.331946888544, 4185.497740271187, 4187.685923555685, 4192.972721683207, 4193.1404062167185, 4827.541383568626, 4840.2255639097575, 4841.95158048415, 4858.708477491362, 4868.269759536098, 5633.549316054706, 5758.481736643722, 5768.74040668171, 5784.611693193603, 5858.150568167592, 1414.5685565902293, 1447.5307562823743, 1453.8982271241123, 1454.2365258239508, 1456.8709250330867, 889.2796834564024, 898.5237823953315, 912.6988093928987, 919.4966230213649, 926.9351145419756, 4809.44691360498, 4847.103285892122, 4849.2726091085915, 4887.584555312767, 4903.289023091703, 5180.84457466269, 5184.455632158644, 5222.529972302435, 5276.762545685377, 5284.603654725834, 4696.825793551612, 4875.000624871893, 4907.263910413467, 4936.0, 5022.4977502249485, 2727.8499682517654, 2741.3283745482486, 2745.8215216010894, 2750.3124218945263, 2750.7936904731823, 5304.469553044742, 5337.5463085637375, 5341.198820177005, 5370.543503802142, 5382.004329199032, 4925.532074452921, 5234.528892399702, 5234.685918844882, 5239.816606418757, 5296.470352964673, 5237.476252374732, 5303.522682958553, 5321.707306098125, 5335.386430560535, 5344.652597581145, 5129.076426436895, 5153.325169320061, 5157.406898206755, 5190.922136167885, 5203.323567936144, 4722.787474563722, 5016.563653897092, 5023.824166154167, 5056.216286475602, 5165.896682066263, 5270.183121616155, 5286.9471305288, 5328.333958255218, 5332.626716129989, 5335.386430560535, 3786.905327366838, 3949.84200631983, 4152.709310348247, 4172.5173521754505, 4179.6029377209115, 5799.840031993703, 5800.6809625471005, 5900.232969714081, 5931.525477961839, 5941.554383421174, 5660.462256085665, 5799.246098007232, 5808.332041815076, 5843.181954526454, 5846.239988801429, 5698.287714035746, 5729.590893418409, 5750.511206547323, 5756.971215143897, 5766.3080430346945, 5702.175303902877, 5729.169270455677, 5741.1388291756575, 5758.193852860519, 5781.0, 5545.500904918576, 5734.283214598176, 5738.340090889601, 5774.220480235114, 5863.384344643751, 5605.663660180402, 5608.943910560843, 5633.3521645009705, 5652.152177173457, 5693.430656934273], "value": 4198.531500070851, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [737.4469148138896, 743.5018537579821, 768.8769796832506, 804.3806269172734, 804.4971892567146, 13544.525941592046, 14853.0, 14879.553613391601, 14888.776668349983, 14899.5530134096, 13681.0, 13758.518451854186, 13777.448902043907, 13788.517401890937, 13809.24049177295, 651.605778504003, 658.6377492379196, 770.299027884625, 776.316841179761, 785.4933567848719, 803.6102490292203, 812.4312980913385, 814.0516298512226, 814.1776805426503, 815.7797394703426, 864.3301441382947, 864.5633954852791, 868.2012548455405, 869.5261082709939, 870.1776820904248, 853.9837593263996, 856.6273670953124, 857.7383897911135, 858.9957050214709, 859.6002858670716, 620.0, 628.915096461981, 629.7229219143608, 630.4609558827228, 632.0771673356904, 13547.051706380556, 13562.728745425036, 13564.796528052088, 13600.863991360058, 13619.931900340534, 14702.26488675562, 14769.926150369287, 14866.776998345034, 14928.701425971529, 14987.400503979938, 11159.158738808086, 11348.489317980711, 11722.88277117235, 11947.761044779056, 12038.217515861441, 3648.5074514940407, 3743.9438408423894, 3835.884923452301, 3876.2635099331037, 3905.687544996422, 87110.56444717736, 89191.0, 89544.99999999935, 90009.0, 90711.54644226802, 11743.47154378055, 11751.47118379675, 11830.94084529589, 11926.224795388272, 12014.459349329301, 23427.297181084596, 23615.527689446113, 23619.40951476227, 23700.288991330286, 23821.404464888168, 7867.409944254089, 7898.9210107899335, 8012.759617211493, 8129.349652027823, 8288.461250018729, 4602.470715867718, 4666.906661866744, 4669.39297891272, 4685.156671799041, 4773.832915847928, 3230.3700778347998, 3311.850966706504, 3312.966870331266, 3335.232896433834, 3394.304167645627, 552.078029690418, 554.9899183486017, 569.900267453194, 577.9797707080317, 585.3151812379526, 685.9965700171567, 689.3933338661946, 729.7336472187613, 743.4758495260828, 755.6486233901153, 9621.470819105016, 9728.610855565697, 9756.707298780906, 10121.898781012243, 10161.307253577808, 704.2112833626371, 711.8540699156661, 718.6514540447879, 733.4425836364402, 757.708282311303, 4568.840090596813, 4706.411698537683, 4901.754912254373, 4963.851084467472, 4965.453800081988, 128308.0, 129589.0, 132738.0, 133152.0, 137285.0, 91702.0, 93473.5326323364, 93824.53087734518, 105846.47076764567, 106637.46681266699, 77570.0, 78258.60870695724, 78645.0, 86277.56861215654, 87300.56349718211, 9519.952400237955, 10057.0, 10128.594856205964, 10204.540795664065, 10378.325408848401, 49170.75414622904, 50580.24129637985, 50900.236496453326, 51230.487695124066, 53119.20321195263, 67911.19021312612, 68317.09402136762, 74033.0, 74180.0, 77755.2224477748, 11702.590409335633, 12102.93948530287, 12250.632481025583, 12310.26138431697, 14019.50931717385, 13842.584722458343, 14088.78866816978, 14797.260136992893, 15214.695706086037, 15275.61810954735, 14099.929500352842, 14193.361298741787, 14195.503157389441, 14363.784543231652, 15004.249787510798, 13666.385012674255, 13901.443942242196, 14238.501652442115, 15083.170425626697, 15247.313870875616, 13865.653358666113, 14013.229272390117, 14302.427902883768, 14682.265886705409, 14768.33542490569, 11235.382053987109, 11694.122940779305, 11807.291562506278, 12057.698557536132, 12195.939020304842, 10725.624603139166, 11985.161038727205, 12014.459349329127, 12150.513979440724, 12265.141440099107], "value": 7599.08371308396, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1524.3000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 116.0, 115.0, 113.0, 113.0, 117.0, 113.0, 114.0, 112.0, 112.0], "value": 114.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 121.0, 120.0, 167.0, 122.0, 121.0, 125.0, 120.0, 165.0, 122.0], "value": 134.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 165.0, 170.0, 168.0, 167.0, 166.0, 168.0, 166.0, 165.0, 165.0], "value": 166.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 79.0, 80.0, 118.0, 79.0, 77.0, 77.0, 78.0, 102.0, 79.0], "value": 84.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 83.0, 129.0, 84.0, 84.0, 83.0, 100.0, 83.0, 83.0, 121.0], "value": 93.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 119.0, 117.0, 118.0, 118.0, 118.0, 117.0, 119.0, 119.0, 118.0], "value": 118.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 152.0, 150.0, 149.0, 152.0, 148.0, 150.0, 151.0, 149.0, 149.0], "value": 149.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [99.0, 99.0, 96.0, 97.0, 96.0, 96.0, 96.0, 96.0, 95.0, 98.0], "value": 96.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [51.0, 52.0, 52.0, 52.0, 52.0, 55.0, 54.0, 53.0, 54.0, 54.0], "value": 52.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 62.0, 61.0, 60.0, 66.0, 61.0, 62.0, 62.0, 61.0, 61.0], "value": 61.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 77.0, 82.0, 81.0, 80.0, 80.0, 80.0, 83.0, 79.0, 88.0], "value": 81.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [143.0, 133.0, 128.0, 129.0, 125.0, 129.0, 131.0, 144.0, 180.0, 126.0], "value": 136.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 170.0, 170.0, 173.0, 165.0, 165.0, 165.0, 166.0, 173.0, 171.0], "value": 168.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 67.0, 67.0, 68.0, 65.0, 65.0, 65.0, 64.0, 64.0], "value": 65.7, "unit": "score"}]}]} 06:09:39 INFO - Return code: 0 06:09:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:09:39 ERROR - # TBPL SUCCESS # 06:09:39 INFO - Running post-action listener: _resource_record_post_action 06:09:39 INFO - [mozharness: 2016-09-21 13:09:39.555652Z] Finished run-tests step (success) 06:09:39 INFO - Running post-run listener: _resource_record_post_run 06:09:39 INFO - Total resource usage - Wall time: 1195s; CPU: 14.0%; Read bytes: 16384; Write bytes: 392658944; Read time: 496; Write time: 303060 06:09:39 INFO - TinderboxPrint: CPU usage
13.5% 06:09:39 INFO - TinderboxPrint: I/O read bytes / time
16,384 / 496 06:09:39 INFO - TinderboxPrint: I/O write bytes / time
392,658,944 / 303,060 06:09:39 INFO - TinderboxPrint: CPU idle
8,238.8 (86.5%) 06:09:39 INFO - TinderboxPrint: CPU user
1,222.6 (12.8%) 06:09:39 INFO - TinderboxPrint: Swap in / out
0 / 0 06:09:39 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 4096; Write bytes: 105705472; Read time: 172; Write time: 81708 06:09:39 INFO - run-tests - Wall time: 1178s; CPU: 14.0%; Read bytes: 8192; Write bytes: 286953472; Read time: 304; Write time: 221352 06:09:40 INFO - Running post-run listener: _upload_blobber_files 06:09:40 INFO - Blob upload gear active. 06:09:40 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:09:40 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 06:09:40 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', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:09:40 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 Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:09:40 INFO - (blobuploader) - INFO - Open directory for files ... 06:09:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:09:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:09:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:09:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:09:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:09:41 INFO - (blobuploader) - INFO - Done attempting. 06:09:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:09:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:09:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:09:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:09:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:09:44 INFO - (blobuploader) - INFO - Done attempting. 06:09:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:09:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:09:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:09:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:09:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:09:45 INFO - (blobuploader) - INFO - Done attempting. 06:09:45 INFO - (blobuploader) - INFO - Iteration through files over. 06:09:45 INFO - Return code: 0 06:09:45 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:09:45 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:09:45 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8d9a150d1a63833e9e7e6deca817449748f45a199743658857caf7874d7390c3f2130ecff6b05ef9f9efba4340afce688f2e238da2e3a7497c954406c7b83302", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/712a4cc7e16746794606422e51b4bf1d8987db7ade549f50f901a0f978443ebd85fd1b4732392eb6fe45e44eda9bdc974b6f21aea4efda98f4d1c294493b7a75", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e1c560b4e5fb117366684b74748eafd6f3537a41d8787da3da9ce7bd1e83244bd85776f312ca4121fcb44a1bdf12a008e06d69b62e4275caa3d1d0670eb95a23"} 06:09:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:09:45 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:09:45 INFO - Contents: 06:09:45 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8d9a150d1a63833e9e7e6deca817449748f45a199743658857caf7874d7390c3f2130ecff6b05ef9f9efba4340afce688f2e238da2e3a7497c954406c7b83302", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/712a4cc7e16746794606422e51b4bf1d8987db7ade549f50f901a0f978443ebd85fd1b4732392eb6fe45e44eda9bdc974b6f21aea4efda98f4d1c294493b7a75", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e1c560b4e5fb117366684b74748eafd6f3537a41d8787da3da9ce7bd1e83244bd85776f312ca4121fcb44a1bdf12a008e06d69b62e4275caa3d1d0670eb95a23"} 06:09:45 INFO - Running post-run listener: copy_logs_to_upload_dir 06:09:45 INFO - Copying logs to upload dir... 06:09:45 INFO - mkdir: /builds/slave/test/build/upload/logs 06:09:45 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1239.426079 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-09-21 06:09:45.279211) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-21 06:09:45.283107) ========= 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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1474462144.380787-732135906 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8d9a150d1a63833e9e7e6deca817449748f45a199743658857caf7874d7390c3f2130ecff6b05ef9f9efba4340afce688f2e238da2e3a7497c954406c7b83302", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/712a4cc7e16746794606422e51b4bf1d8987db7ade549f50f901a0f978443ebd85fd1b4732392eb6fe45e44eda9bdc974b6f21aea4efda98f4d1c294493b7a75", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e1c560b4e5fb117366684b74748eafd6f3537a41d8787da3da9ce7bd1e83244bd85776f312ca4121fcb44a1bdf12a008e06d69b62e4275caa3d1d0670eb95a23"} build_url:https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011324 build_url: 'https://queue.taskcluster.net/v1/task/Z7A03dzBSQiQqsvj6cHvlw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8d9a150d1a63833e9e7e6deca817449748f45a199743658857caf7874d7390c3f2130ecff6b05ef9f9efba4340afce688f2e238da2e3a7497c954406c7b83302", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/712a4cc7e16746794606422e51b4bf1d8987db7ade549f50f901a0f978443ebd85fd1b4732392eb6fe45e44eda9bdc974b6f21aea4efda98f4d1c294493b7a75", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e1c560b4e5fb117366684b74748eafd6f3537a41d8787da3da9ce7bd1e83244bd85776f312ca4121fcb44a1bdf12a008e06d69b62e4275caa3d1d0670eb95a23"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-21 06:09:45.308088) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-21 06:09:45.308380) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1474462144.380787-732135906 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004395 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-21 06:09:45.391529) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-21 06:09:45.391859) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-21 06:09:45.392152) ========= ========= Total master_lag: 0.16 =========