builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-040 starttime: 1468668116.66 results: success (0) buildid: 20160716013011 builduid: f00423380d51420d80de489ac5f816cc revision: 4c05938a64a7fde3ac2d7f4493aee1c5f2ad8a0a ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:56.662504) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:56.662944) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:56.663231) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:56.686847) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:56.687380) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-16 04:21:57-- 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% 86.9M=0s 2016-07-16 04:21:57 (86.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.129861 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:56.833000) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:56.833341) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023183 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:56.882825) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-16 04:21:56.883156) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 4c05938a64a7fde3ac2d7f4493aee1c5f2ad8a0a --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 4c05938a64a7fde3ac2d7f4493aee1c5f2ad8a0a --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=9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-16 04:21:57,438 truncating revision to first 12 chars 2016-07-16 04:21:57,439 Setting DEBUG logging. 2016-07-16 04:21:57,439 attempt 1/10 2016-07-16 04:21:57,439 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/4c05938a64a7?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-16 04:21:58,171 unpacking tar archive at: mozilla-central-4c05938a64a7/testing/mozharness/ program finished with exit code 0 elapsedTime=1.072970 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-16 04:21:57.969835) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:57.970172) ========= script_repo_revision: 4c05938a64a7fde3ac2d7f4493aee1c5f2ad8a0a ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:57.970578) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:57.970859) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-16 04:21:57.981276) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-07-16 04:21:57.981664) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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=9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:21:58 INFO - MultiFileLogger online at 20160716 04:21:58 in /builds/slave/test 04:21:58 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 04:21:58 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:21:58 INFO - {'append_to_log': False, 04:21:58 INFO - 'base_work_dir': '/builds/slave/test', 04:21:58 INFO - 'blob_upload_branch': 'Firefox', 04:21:58 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:21:58 INFO - 'branch': 'Firefox', 04:21:58 INFO - 'buildbot_json_path': 'buildprops.json', 04:21:58 INFO - 'config_files': ('talos/linux_config.py',), 04:21:58 INFO - 'default_actions': ('clobber', 04:21:58 INFO - 'read-buildbot-config', 04:21:58 INFO - 'download-and-extract', 04:21:58 INFO - 'populate-webroot', 04:21:58 INFO - 'create-virtualenv', 04:21:58 INFO - 'install', 04:21:58 INFO - 'run-tests'), 04:21:58 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:21:58 INFO - 'download_minidump_stackwalk': True, 04:21:58 INFO - 'download_symbols': 'ondemand', 04:21:58 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:21:58 INFO - 'tooltool.py': '/tools/tooltool.py', 04:21:58 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:21:58 INFO - '/tools/misc-python/virtualenv.py')}, 04:21:58 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:21:58 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:21:58 INFO - 'installer_path': 'installer.exe', 04:21:58 INFO - 'log_level': 'info', 04:21:58 INFO - 'log_name': 'talos', 04:21:58 INFO - 'log_to_console': True, 04:21:58 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:21:58 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:21:58 INFO - 'opt_config_files': (), 04:21:58 INFO - 'pip_index': False, 04:21:58 INFO - 'sps_profile': False, 04:21:58 INFO - 'sps_profile_interval': 0, 04:21:58 INFO - 'suite': 'dromaeojs', 04:21:58 INFO - 'system_bits': '32', 04:21:58 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:21:58 INFO - 'title': 'talos-linux64-ix-040', 04:21:58 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:21:58 INFO - 'use_talos_json': True, 04:21:58 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:21:58 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:21:58 INFO - 'work_dir': 'build'} 04:21:58 INFO - ##### 04:21:58 INFO - ##### Running clobber step. 04:21:58 INFO - ##### 04:21:58 INFO - Running pre-action listener: _resource_record_pre_action 04:21:58 INFO - Running main action method: clobber 04:21:58 INFO - rmtree: /builds/slave/test/build 04:21:58 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:21:59 INFO - Running post-action listener: _resource_record_post_action 04:21:59 INFO - ##### 04:21:59 INFO - ##### Finished clobber step (success) 04:21:59 INFO - ##### 04:21:59 INFO - ##### 04:21:59 INFO - ##### Running read-buildbot-config step. 04:21:59 INFO - ##### 04:21:59 INFO - Running pre-action listener: _resource_record_pre_action 04:21:59 INFO - Running main action method: read_buildbot_config 04:21:59 INFO - Using buildbot properties: 04:21:59 INFO - { 04:21:59 INFO - "project": "", 04:21:59 INFO - "product": "firefox", 04:21:59 INFO - "script_repo_revision": "production", 04:21:59 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 04:21:59 INFO - "repository": "", 04:21:59 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 04:21:59 INFO - "buildid": "20160716013011", 04:21:59 INFO - "pgo_build": "True", 04:21:59 INFO - "basedir": "/builds/slave/test", 04:21:59 INFO - "buildnumber": 396, 04:21:59 INFO - "slavename": "talos-linux64-ix-040", 04:21:59 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 04:21:59 INFO - "platform": "ubuntu64_hw", 04:21:59 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 04:21:59 INFO - "branch": "mozilla-central", 04:21:59 INFO - "repo_path": "mozilla-central", 04:21:59 INFO - "revision": "4c05938a64a7fde3ac2d7f4493aee1c5f2ad8a0a", 04:21:59 INFO - "stage_platform": "linux64-pgo", 04:21:59 INFO - "builduid": "f00423380d51420d80de489ac5f816cc", 04:21:59 INFO - "slavebuilddir": "test" 04:21:59 INFO - } 04:21:59 INFO - Found installer url https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 04:21:59 INFO - Running post-action listener: _resource_record_post_action 04:21:59 INFO - ##### 04:21:59 INFO - ##### Finished read-buildbot-config step (success) 04:21:59 INFO - ##### 04:21:59 INFO - ##### 04:21:59 INFO - ##### Running download-and-extract step. 04:21:59 INFO - ##### 04:21:59 INFO - Running pre-action listener: _resource_record_pre_action 04:21:59 INFO - Running main action method: download_and_extract 04:21:59 INFO - mkdir: /builds/slave/test/build/tests 04:21:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:21:59 INFO - https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 04:21:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 04:21:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 04:21:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 04:21:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 04:21:59 INFO - Downloaded 1361 bytes. 04:21:59 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 04:21:59 INFO - Using the following test package requirements: 04:21:59 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 04:21:59 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:21:59 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 04:21:59 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'jsshell-linux-x86_64.zip'], 04:21:59 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:21:59 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 04:21:59 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:21:59 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:21:59 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:21:59 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:21:59 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:21:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:21:59 INFO - https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:21:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:21:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:21:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:21:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:22:02 INFO - Downloaded 24328319 bytes. 04:22:02 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:22:02 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 04:22:03 INFO - Return code: 0 04:22:03 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:22:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:03 INFO - https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:22:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:22:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:22:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:22:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:22:10 INFO - Downloaded 24328319 bytes. 04:22:10 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:22:10 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 04:22:12 INFO - Return code: 0 04:22:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:12 INFO - https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:22:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 04:22:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 04:22:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 04:22:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:22:12 INFO - Downloaded 14403317 bytes. 04:22:12 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:22:12 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 04:22:13 INFO - Return code: 0 04:22:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:13 INFO - https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:22:13 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:22:13 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:22:13 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:22:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:22:14 INFO - Downloaded 60815486 bytes. 04:22:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:22:14 INFO - mkdir: /builds/slave/test/properties 04:22:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:22:14 INFO - Writing to file /builds/slave/test/properties/build_url 04:22:14 INFO - Contents: 04:22:14 INFO - build_url:https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:22:15 INFO - Running post-action listener: _resource_record_post_action 04:22:15 INFO - Running post-action listener: set_extra_try_arguments 04:22:15 INFO - ##### 04:22:15 INFO - ##### Finished download-and-extract step (success) 04:22:15 INFO - ##### 04:22:15 INFO - ##### 04:22:15 INFO - ##### Running populate-webroot step. 04:22:15 INFO - ##### 04:22:15 INFO - Running pre-action listener: _resource_record_pre_action 04:22:15 INFO - Running main action method: populate_webroot 04:22:15 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:22:15 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:22:15 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:22:15 INFO - '--tppagecycles', 04:22:15 INFO - '7'], 04:22:15 INFO - 'tests': ['tsvgm']}}, 04:22:15 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:22:15 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:22:15 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:22:15 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:22:15 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:15 INFO - 'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:22:15 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:15 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:22:15 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:15 INFO - 'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['damp', 'tps']}, 04:22:15 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:15 INFO - 'tests': ['damp', 'tps']}, 04:22:15 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['dromaeo_dom']}, 04:22:15 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:22:15 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['basic_compositor_video']}, 04:22:15 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 04:22:15 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['a11yr', 04:22:15 INFO - 'ts_paint', 04:22:15 INFO - 'tpaint', 04:22:15 INFO - 'sessionrestore', 04:22:15 INFO - 'sessionrestore_no_auto_restore', 04:22:15 INFO - 'tabpaint']}, 04:22:15 INFO - 'other-e10s': {'tests': ['a11yr', 04:22:15 INFO - 'ts_paint', 04:22:15 INFO - 'tpaint', 04:22:15 INFO - 'sessionrestore', 04:22:15 INFO - 'sessionrestore_no_auto_restore', 04:22:15 INFO - 'tabpaint']}, 04:22:15 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:22:15 INFO - 'ts_paint', 04:22:15 INFO - 'tpaint', 04:22:15 INFO - 'sessionrestore', 04:22:15 INFO - 'sessionrestore_no_auto_restore', 04:22:15 INFO - 'tabpaint']}, 04:22:15 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:22:15 INFO - 'ts_paint', 04:22:15 INFO - 'tpaint', 04:22:15 INFO - 'sessionrestore', 04:22:15 INFO - 'sessionrestore_no_auto_restore', 04:22:15 INFO - 'tabpaint']}, 04:22:15 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['a11yr', 04:22:15 INFO - 'ts_paint', 04:22:15 INFO - 'tpaint', 04:22:15 INFO - 'sessionrestore', 04:22:15 INFO - 'sessionrestore_no_auto_restore', 04:22:15 INFO - 'tabpaint']}, 04:22:15 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['a11yr', 04:22:15 INFO - 'ts_paint', 04:22:15 INFO - 'tpaint', 04:22:15 INFO - 'sessionrestore', 04:22:15 INFO - 'sessionrestore_no_auto_restore', 04:22:15 INFO - 'tabpaint']}, 04:22:15 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['tsvgx', 04:22:15 INFO - 'tsvgr_opacity', 04:22:15 INFO - 'tart', 04:22:15 INFO - 'tscrollx', 04:22:15 INFO - 'cart']}, 04:22:15 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:22:15 INFO - 'tsvgr_opacity', 04:22:15 INFO - 'tart', 04:22:15 INFO - 'tscrollx', 04:22:15 INFO - 'cart']}, 04:22:15 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:15 INFO - 'talos_options': ['--disable-e10s'], 04:22:15 INFO - 'tests': ['tp5o']}, 04:22:15 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:15 INFO - 'tests': ['tp5o']}, 04:22:15 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:15 INFO - 'talos_options': ['--disable-e10s', 04:22:15 INFO - '--xperf_path', 04:22:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:22:15 INFO - 'tests': ['tp5n']}, 04:22:15 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:15 INFO - 'talos_options': ['--xperf_path', 04:22:15 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:22:15 INFO - 'tests': ['tp5n']}}, 04:22:15 INFO - 'talos.zip': {'path': '', 04:22:15 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:22:15 INFO - Running post-action listener: _resource_record_post_action 04:22:15 INFO - ##### 04:22:15 INFO - ##### Finished populate-webroot step (success) 04:22:15 INFO - ##### 04:22:15 INFO - ##### 04:22:15 INFO - ##### Running create-virtualenv step. 04:22:15 INFO - ##### 04:22:15 INFO - Running pre-action listener: _resource_record_pre_action 04:22:15 INFO - Running main action method: create_virtualenv 04:22:15 INFO - Creating virtualenv /builds/slave/test/build/venv 04:22:15 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 04:22:15 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:22:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:22:15 INFO - Using real prefix '/usr' 04:22:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:22:15 INFO - Installing distribute.............................................................................................................................................................................................done. 04:22:17 INFO - Installing pip.................done. 04:22:17 INFO - Return code: 0 04:22:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:22:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:17 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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22:17 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 04:22:17 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 04:22:17 INFO - Using env: {'DISPLAY': ':0', 04:22:17 INFO - 'HOME': '/home/cltbld', 04:22:17 INFO - 'LANG': 'en_US.UTF-8', 04:22:17 INFO - 'LANGUAGE': 'en_US:en', 04:22:17 INFO - 'LOGNAME': 'cltbld', 04:22:17 INFO - 'MAIL': '/var/mail/cltbld', 04:22:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:17 INFO - 'MOZ_NO_REMOTE': '1', 04:22:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:17 INFO - 'NO_EM_RESTART': '1', 04:22:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:17 INFO - 'PWD': '/builds/slave/test', 04:22:17 INFO - 'SHELL': '/bin/bash', 04:22:17 INFO - 'SHLVL': '1', 04:22:17 INFO - 'TERM': 'linux', 04:22:17 INFO - 'TMOUT': '86400', 04:22:17 INFO - 'USER': 'cltbld', 04:22:17 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:17 INFO - '_': '/tools/buildbot/bin/python'} 04:22:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:18 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 04:22:18 INFO - Cleaning up... 04:22:18 INFO - Return code: 0 04:22:18 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:22:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:18 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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22:18 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 04:22:18 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 04:22:18 INFO - Using env: {'DISPLAY': ':0', 04:22:18 INFO - 'HOME': '/home/cltbld', 04:22:18 INFO - 'LANG': 'en_US.UTF-8', 04:22:18 INFO - 'LANGUAGE': 'en_US:en', 04:22:18 INFO - 'LOGNAME': 'cltbld', 04:22:18 INFO - 'MAIL': '/var/mail/cltbld', 04:22:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:18 INFO - 'MOZ_NO_REMOTE': '1', 04:22:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:18 INFO - 'NO_EM_RESTART': '1', 04:22:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:18 INFO - 'PWD': '/builds/slave/test', 04:22:18 INFO - 'SHELL': '/bin/bash', 04:22:18 INFO - 'SHLVL': '1', 04:22:18 INFO - 'TERM': 'linux', 04:22:18 INFO - 'TMOUT': '86400', 04:22:18 INFO - 'USER': 'cltbld', 04:22:18 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:18 INFO - '_': '/tools/buildbot/bin/python'} 04:22:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:18 INFO - Downloading/unpacking psutil>=3.1.1 04:22:18 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 04:22:18 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 04:22:18 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 04:22:18 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 04:22:18 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 04:22:18 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 04:22:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:22:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:22:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:22:20 INFO - Installing collected packages: psutil 04:22:20 INFO - Running setup.py install for psutil 04:22:20 INFO - building 'psutil._psutil_linux' extension 04:22:20 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 04:22:20 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 04:22:20 INFO - building 'psutil._psutil_posix' extension 04:22:20 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 04:22:20 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 04:22:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:22:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:22:20 INFO - Successfully installed psutil 04:22:20 INFO - Cleaning up... 04:22:20 INFO - Return code: 0 04:22:20 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:22:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:20 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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22:20 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 04:22:20 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 04:22:20 INFO - Using env: {'DISPLAY': ':0', 04:22:20 INFO - 'HOME': '/home/cltbld', 04:22:20 INFO - 'LANG': 'en_US.UTF-8', 04:22:20 INFO - 'LANGUAGE': 'en_US:en', 04:22:20 INFO - 'LOGNAME': 'cltbld', 04:22:20 INFO - 'MAIL': '/var/mail/cltbld', 04:22:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:20 INFO - 'MOZ_NO_REMOTE': '1', 04:22:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:20 INFO - 'NO_EM_RESTART': '1', 04:22:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:20 INFO - 'PWD': '/builds/slave/test', 04:22:20 INFO - 'SHELL': '/bin/bash', 04:22:20 INFO - 'SHLVL': '1', 04:22:20 INFO - 'TERM': 'linux', 04:22:20 INFO - 'TMOUT': '86400', 04:22:20 INFO - 'USER': 'cltbld', 04:22:20 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:20 INFO - '_': '/tools/buildbot/bin/python'} 04:22:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:21 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:22:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:22 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:22:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:22:23 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:22:23 INFO - Installing collected packages: mozsystemmonitor 04:22:23 INFO - Running setup.py install for mozsystemmonitor 04:22:23 INFO - Successfully installed mozsystemmonitor 04:22:23 INFO - Cleaning up... 04:22:23 INFO - Return code: 0 04:22:23 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:22:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:23 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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22:23 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 04:22:23 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 04:22:23 INFO - Using env: {'DISPLAY': ':0', 04:22:23 INFO - 'HOME': '/home/cltbld', 04:22:23 INFO - 'LANG': 'en_US.UTF-8', 04:22:23 INFO - 'LANGUAGE': 'en_US:en', 04:22:23 INFO - 'LOGNAME': 'cltbld', 04:22:23 INFO - 'MAIL': '/var/mail/cltbld', 04:22:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:23 INFO - 'MOZ_NO_REMOTE': '1', 04:22:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:23 INFO - 'NO_EM_RESTART': '1', 04:22:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:23 INFO - 'PWD': '/builds/slave/test', 04:22:23 INFO - 'SHELL': '/bin/bash', 04:22:23 INFO - 'SHLVL': '1', 04:22:23 INFO - 'TERM': 'linux', 04:22:23 INFO - 'TMOUT': '86400', 04:22:23 INFO - 'USER': 'cltbld', 04:22:23 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:23 INFO - '_': '/tools/buildbot/bin/python'} 04:22:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:23 INFO - Downloading/unpacking jsonschema==2.5.1 04:22:23 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 04:22:23 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 04:22:23 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 04:22:23 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 04:22:23 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 04:22:23 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 04:22:25 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:22:25 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:22: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 04:22: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 04:22: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 04:22: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 04:22: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 04:22: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 04:22:25 INFO - Downloading functools32-3.2.3-2.tar.gz 04:22:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:22:25 INFO - warning: no files found matching '*.txt' 04:22:25 INFO - no previously-included directories found matching 'build' 04:22:25 INFO - no previously-included directories found matching 'dist' 04:22:25 INFO - no previously-included directories found matching '.git*' 04:22:25 INFO - Installing collected packages: jsonschema, functools32 04:22:25 INFO - Running setup.py install for functools32 04:22:25 INFO - warning: no files found matching '*.txt' 04:22:25 INFO - no previously-included directories found matching 'build' 04:22:25 INFO - no previously-included directories found matching 'dist' 04:22:25 INFO - no previously-included directories found matching '.git*' 04:22:25 INFO - Successfully installed jsonschema functools32 04:22:25 INFO - Cleaning up... 04:22:25 INFO - Return code: 0 04:22:25 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:22:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22: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', '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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:22: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 blobuploader==1.2.4 04:22:25 INFO - Using env: {'DISPLAY': ':0', 04:22:25 INFO - 'HOME': '/home/cltbld', 04:22:25 INFO - 'LANG': 'en_US.UTF-8', 04:22:25 INFO - 'LANGUAGE': 'en_US:en', 04:22:25 INFO - 'LOGNAME': 'cltbld', 04:22:25 INFO - 'MAIL': '/var/mail/cltbld', 04:22:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:25 INFO - 'MOZ_NO_REMOTE': '1', 04:22:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:25 INFO - 'NO_EM_RESTART': '1', 04:22:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:25 INFO - 'PWD': '/builds/slave/test', 04:22:25 INFO - 'SHELL': '/bin/bash', 04:22:25 INFO - 'SHLVL': '1', 04:22:25 INFO - 'TERM': 'linux', 04:22:25 INFO - 'TMOUT': '86400', 04:22:25 INFO - 'USER': 'cltbld', 04:22:25 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:25 INFO - '_': '/tools/buildbot/bin/python'} 04:22:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:26 INFO - Downloading/unpacking blobuploader==1.2.4 04:22:26 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 04:22:26 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 04:22:26 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 04:22:26 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 04:22:26 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 04:22:26 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 04:22:27 INFO - Downloading blobuploader-1.2.4.tar.gz 04:22:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:22:28 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:22: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 04:22: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 04:22: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 04:22: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 04:22: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 04:22: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 04:22:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:22:28 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:22: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 04:22: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 04:22: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 04:22: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 04:22: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 04:22: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 04:22:28 INFO - Downloading docopt-0.6.1.tar.gz 04:22:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:22:28 INFO - Installing collected packages: blobuploader, requests, docopt 04:22:28 INFO - Running setup.py install for blobuploader 04:22:28 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:22:28 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:22:28 INFO - Running setup.py install for requests 04:22:29 INFO - Running setup.py install for docopt 04:22:29 INFO - Successfully installed blobuploader requests docopt 04:22:29 INFO - Cleaning up... 04:22:29 INFO - Return code: 0 04:22:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:22:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:29 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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22:29 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 04:22:29 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 04:22:29 INFO - Using env: {'DISPLAY': ':0', 04:22:29 INFO - 'HOME': '/home/cltbld', 04:22:29 INFO - 'LANG': 'en_US.UTF-8', 04:22:29 INFO - 'LANGUAGE': 'en_US:en', 04:22:29 INFO - 'LOGNAME': 'cltbld', 04:22:29 INFO - 'MAIL': '/var/mail/cltbld', 04:22:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:29 INFO - 'MOZ_NO_REMOTE': '1', 04:22:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:29 INFO - 'NO_EM_RESTART': '1', 04:22:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:29 INFO - 'PWD': '/builds/slave/test', 04:22:29 INFO - 'SHELL': '/bin/bash', 04:22:29 INFO - 'SHLVL': '1', 04:22:29 INFO - 'TERM': 'linux', 04:22:29 INFO - 'TMOUT': '86400', 04:22:29 INFO - 'USER': 'cltbld', 04:22:29 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:29 INFO - '_': '/tools/buildbot/bin/python'} 04:22:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:22:29 INFO - Running setup.py (path:/tmp/pip-KVNiUL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:22:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:22:29 INFO - Running setup.py (path:/tmp/pip-xS0ZrK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:22:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:22:29 INFO - Running setup.py (path:/tmp/pip-apsgWF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:22:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:22:29 INFO - Running setup.py (path:/tmp/pip-nYnQKF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:22:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:22:29 INFO - Running setup.py (path:/tmp/pip-4CfGI_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:22:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:22:29 INFO - Running setup.py (path:/tmp/pip-twt3hd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:22:30 INFO - Running setup.py (path:/tmp/pip-z4s6Le-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:22:30 INFO - Running setup.py (path:/tmp/pip-3UXa0f-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:22:30 INFO - Running setup.py (path:/tmp/pip-alv6YE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:22:30 INFO - Running setup.py (path:/tmp/pip-BgUaVX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:22:30 INFO - Running setup.py (path:/tmp/pip-JNXkge-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:22:30 INFO - Running setup.py (path:/tmp/pip-hOtbEU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:22:30 INFO - Running setup.py (path:/tmp/pip-1KkQ47-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:22:30 INFO - Running setup.py (path:/tmp/pip-0SrZt4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:22:30 INFO - Running setup.py (path:/tmp/pip-ADIyLm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:22:30 INFO - Running setup.py (path:/tmp/pip-3RLEz4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:22:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:22:30 INFO - Running setup.py (path:/tmp/pip-0BTqVd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:22:30 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:22:30 INFO - Running setup.py install for manifestparser 04:22:30 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:22:30 INFO - Running setup.py install for mozcrash 04:22:31 INFO - Running setup.py install for mozdebug 04:22:31 INFO - Running setup.py install for mozdevice 04:22:31 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Running setup.py install for mozfile 04:22:31 INFO - Running setup.py install for mozhttpd 04:22:31 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Running setup.py install for mozinfo 04:22:31 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Running setup.py install for mozInstall 04:22:31 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Running setup.py install for mozleak 04:22:31 INFO - Running setup.py install for mozlog 04:22:31 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Running setup.py install for moznetwork 04:22:31 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:22:31 INFO - Running setup.py install for mozprocess 04:22:32 INFO - Running setup.py install for mozprofile 04:22:32 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:22:32 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:22:32 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:22:32 INFO - Running setup.py install for mozrunner 04:22:32 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:22:32 INFO - Running setup.py install for mozscreenshot 04:22:32 INFO - Running setup.py install for moztest 04:22:32 INFO - Running setup.py install for mozversion 04:22:32 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:22:32 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:22:32 INFO - Cleaning up... 04:22:32 INFO - Return code: 0 04:22:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:22: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:32 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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22:32 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 04:22:32 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 04:22:32 INFO - Using env: {'DISPLAY': ':0', 04:22:32 INFO - 'HOME': '/home/cltbld', 04:22:32 INFO - 'LANG': 'en_US.UTF-8', 04:22:32 INFO - 'LANGUAGE': 'en_US:en', 04:22:32 INFO - 'LOGNAME': 'cltbld', 04:22:32 INFO - 'MAIL': '/var/mail/cltbld', 04:22:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:32 INFO - 'MOZ_NO_REMOTE': '1', 04:22:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:32 INFO - 'NO_EM_RESTART': '1', 04:22:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:32 INFO - 'PWD': '/builds/slave/test', 04:22:32 INFO - 'SHELL': '/bin/bash', 04:22:32 INFO - 'SHLVL': '1', 04:22:32 INFO - 'TERM': 'linux', 04:22:32 INFO - 'TMOUT': '86400', 04:22:32 INFO - 'USER': 'cltbld', 04:22:32 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:32 INFO - '_': '/tools/buildbot/bin/python'} 04:22:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:22:32 INFO - Running setup.py (path:/tmp/pip-0BQoff-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:22:32 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)) 04:22:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:22:32 INFO - Running setup.py (path:/tmp/pip-lwkNCZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:22:32 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)) 04:22:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:22:32 INFO - Running setup.py (path:/tmp/pip-y18y2j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:22:33 INFO - Running setup.py (path:/tmp/pip-z9mzNg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:22:33 INFO - Running setup.py (path:/tmp/pip-xNItU4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:22:33 INFO - Running setup.py (path:/tmp/pip-UPBVSH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:22:33 INFO - Running setup.py (path:/tmp/pip-Dm6Xoz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:22:33 INFO - Running setup.py (path:/tmp/pip-M4KmaI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:22:33 INFO - Running setup.py (path:/tmp/pip-CSXRRB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:22:33 INFO - Running setup.py (path:/tmp/pip-v_d0se-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:22:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:22:33 INFO - Running setup.py (path:/tmp/pip-cpQgkO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:22:33 INFO - Running setup.py (path:/tmp/pip-M_7yLr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:22:33 INFO - Running setup.py (path:/tmp/pip-5Z9FNT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:22:33 INFO - Running setup.py (path:/tmp/pip-sddMlt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:22:33 INFO - Running setup.py (path:/tmp/pip-jg18ib-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:22:33 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)) 04:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:22:33 INFO - Running setup.py (path:/tmp/pip-PN5aVj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:22:34 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)) 04:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:22:34 INFO - Running setup.py (path:/tmp/pip-5BiiQw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:22:34 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)) 04:22:34 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)) 04:22:34 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)) 04:22:34 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)) 04:22:34 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)) 04:22:34 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)) 04:22:34 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:22:34 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 04:22:34 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 04:22:34 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 04:22:34 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 04:22:34 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 04:22:34 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 04:22:36 INFO - Downloading blessings-1.6.tar.gz 04:22:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:22:36 INFO - Installing collected packages: blessings 04:22:36 INFO - Running setup.py install for blessings 04:22:36 INFO - Successfully installed blessings 04:22:36 INFO - Cleaning up... 04:22:36 INFO - Return code: 0 04:22:36 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:22:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:22:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:22:36 INFO - Reading from file tmpfile_stdout 04:22:36 INFO - Current package versions: 04:22:36 INFO - argparse == 1.2.1 04:22:36 INFO - blessings == 1.6 04:22:36 INFO - blobuploader == 1.2.4 04:22:36 INFO - docopt == 0.6.1 04:22:36 INFO - functools32 == 3.2.3-2 04:22:36 INFO - jsonschema == 2.5.1 04:22:36 INFO - manifestparser == 1.1 04:22:36 INFO - mozInstall == 1.12 04:22:36 INFO - mozcrash == 0.17 04:22:36 INFO - mozdebug == 0.1 04:22:36 INFO - mozdevice == 0.48 04:22:36 INFO - mozfile == 1.2 04:22:36 INFO - mozhttpd == 0.7 04:22:36 INFO - mozinfo == 0.9 04:22:36 INFO - mozleak == 0.1 04:22:36 INFO - mozlog == 3.2 04:22:36 INFO - moznetwork == 0.27 04:22:36 INFO - mozprocess == 0.23 04:22:36 INFO - mozprofile == 0.28 04:22:36 INFO - mozrunner == 6.12 04:22:36 INFO - mozscreenshot == 0.1 04:22:36 INFO - mozsystemmonitor == 0.3 04:22:36 INFO - moztest == 0.7 04:22:36 INFO - mozversion == 1.4 04:22:36 INFO - psutil == 3.1.1 04:22:36 INFO - requests == 1.2.3 04:22:36 INFO - wsgiref == 0.1.2 04:22:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:22: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:36 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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22:36 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 04:22:36 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 04:22:36 INFO - Using env: {'DISPLAY': ':0', 04:22:36 INFO - 'HOME': '/home/cltbld', 04:22:36 INFO - 'LANG': 'en_US.UTF-8', 04:22:36 INFO - 'LANGUAGE': 'en_US:en', 04:22:36 INFO - 'LOGNAME': 'cltbld', 04:22:36 INFO - 'MAIL': '/var/mail/cltbld', 04:22:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:36 INFO - 'MOZ_NO_REMOTE': '1', 04:22:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:36 INFO - 'NO_EM_RESTART': '1', 04:22:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:36 INFO - 'PWD': '/builds/slave/test', 04:22:36 INFO - 'SHELL': '/bin/bash', 04:22:36 INFO - 'SHLVL': '1', 04:22:36 INFO - 'TERM': 'linux', 04:22:36 INFO - 'TMOUT': '86400', 04:22:36 INFO - 'USER': 'cltbld', 04:22:36 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:36 INFO - '_': '/tools/buildbot/bin/python'} 04:22:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 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)) 04:22:36 INFO - Cleaning up... 04:22:36 INFO - Return code: 0 04:22:36 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:22: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:36 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 0x10d3030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1394180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, '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': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', '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 04:22:36 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 04:22:36 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 04:22:36 INFO - Using env: {'DISPLAY': ':0', 04:22:36 INFO - 'HOME': '/home/cltbld', 04:22:36 INFO - 'LANG': 'en_US.UTF-8', 04:22:36 INFO - 'LANGUAGE': 'en_US:en', 04:22:36 INFO - 'LOGNAME': 'cltbld', 04:22:36 INFO - 'MAIL': '/var/mail/cltbld', 04:22:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:36 INFO - 'MOZ_NO_REMOTE': '1', 04:22:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:36 INFO - 'NO_EM_RESTART': '1', 04:22:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:36 INFO - 'PWD': '/builds/slave/test', 04:22:36 INFO - 'SHELL': '/bin/bash', 04:22:36 INFO - 'SHLVL': '1', 04:22:36 INFO - 'TERM': 'linux', 04:22:36 INFO - 'TMOUT': '86400', 04:22:36 INFO - 'USER': 'cltbld', 04:22:36 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:36 INFO - '_': '/tools/buildbot/bin/python'} 04:22:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:36 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:22:36 INFO - Cleaning up... 04:22:36 INFO - Return code: 0 04:22:36 INFO - Running post-action listener: _resource_record_post_action 04:22:36 INFO - Running post-action listener: _start_resource_monitoring 04:22:36 INFO - Starting resource monitoring. 04:22:36 INFO - ##### 04:22:36 INFO - ##### Finished create-virtualenv step (success) 04:22:36 INFO - ##### 04:22:36 INFO - ##### 04:22:36 INFO - ##### Running install step. 04:22:36 INFO - ##### 04:22:36 INFO - Running pre-action listener: _resource_record_pre_action 04:22:36 INFO - Running main action method: install 04:22:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:22:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:22:37 INFO - Reading from file tmpfile_stdout 04:22:37 INFO - Detecting whether we're running mozinstall >=1.0... 04:22:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:22:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:22:37 INFO - Reading from file tmpfile_stdout 04:22:37 INFO - Output received: 04:22:37 INFO - Usage: mozinstall [options] installer 04:22:37 INFO - Options: 04:22:37 INFO - -h, --help show this help message and exit 04:22:37 INFO - -d DEST, --destination=DEST 04:22:37 INFO - Directory to install application into. [default: 04:22:37 INFO - "/builds/slave/test"] 04:22:37 INFO - --app=APP Application being installed. [default: firefox] 04:22:37 INFO - mkdir: /builds/slave/test/build/application 04:22:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 04:22:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 04:22:54 INFO - Reading from file tmpfile_stdout 04:22:54 INFO - Output received: 04:22:54 INFO - /builds/slave/test/build/application/firefox/firefox 04:22:54 INFO - Running post-action listener: _resource_record_post_action 04:22:54 INFO - ##### 04:22:54 INFO - ##### Finished install step (success) 04:22:54 INFO - ##### 04:22:54 INFO - ##### 04:22:54 INFO - ##### Running run-tests step. 04:22:54 INFO - ##### 04:22:54 INFO - Running pre-action listener: _resource_record_pre_action 04:22:54 INFO - Running main action method: run_tests 04:22:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:22:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:22:54 INFO - Python 2.7.3 04:22:54 INFO - Return code: 0 04:22:54 INFO - grabbing minidump binary from tooltool 04:22:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:54 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 0x13923b0>, '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 0x13932b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1393740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:22:54 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 04:22:54 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 04:22:54 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 04:22:54 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:22:54 INFO - Return code: 0 04:22:54 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:22:54 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:22:54 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:22:54 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:22:54 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:22:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-040', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 04:22:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-040 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 04:22:54 INFO - Using env: {'DISPLAY': ':0', 04:22:54 INFO - 'HOME': '/home/cltbld', 04:22:54 INFO - 'LANG': 'en_US.UTF-8', 04:22:54 INFO - 'LANGUAGE': 'en_US:en', 04:22:54 INFO - 'LOGNAME': 'cltbld', 04:22:54 INFO - 'MAIL': '/var/mail/cltbld', 04:22:54 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:22:54 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:22:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:54 INFO - 'MOZ_NO_REMOTE': '1', 04:22:54 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:22:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:54 INFO - 'NO_EM_RESTART': '1', 04:22:54 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:22:54 INFO - 'PWD': '/builds/slave/test', 04:22:54 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:22:54 INFO - 'SHELL': '/bin/bash', 04:22:54 INFO - 'SHLVL': '1', 04:22:54 INFO - 'TERM': 'linux', 04:22:54 INFO - 'TMOUT': '86400', 04:22:54 INFO - 'USER': 'cltbld', 04:22:54 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322', 04:22:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:54 INFO - '_': '/tools/buildbot/bin/python'} 04:22:54 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-040', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 04:22:54 INFO - mozversion application_buildid: 20160716013011 04:22:54 INFO - mozversion application_changeset: 4c05938a64a7fde3ac2d7f4493aee1c5f2ad8a0a 04:22:54 INFO - mozversion application_display_name: Nightly 04:22:54 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:22:54 INFO - mozversion application_name: Firefox 04:22:54 INFO - mozversion application_remotingname: firefox 04:22:54 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:22:54 INFO - mozversion application_vendor: Mozilla 04:22:54 INFO - mozversion application_version: 50.0a1 04:22:54 INFO - mozversion platform_buildid: 20160716013011 04:22:54 INFO - mozversion platform_changeset: 4c05938a64a7fde3ac2d7f4493aee1c5f2ad8a0a 04:22:54 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:22:54 INFO - mozversion platform_version: 50.0a1 04:22:54 INFO - using testdate: 1468668174 04:22:54 INFO - actual date: 1468668174 04:22:54 INFO - starting webserver on 'localhost:46728' 04:22:54 INFO - SUITE-START | Running 2 tests 04:22:54 INFO - TEST-START | dromaeo_css 04:22:54 INFO - operating with platform_type : linux_ 04:22:54 INFO - Initialising browser for dromaeo_css test... 04:22:54 INFO - TEST-INFO | started process 17098 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpaNkMS3/profile http://localhost:46728/getInfo.html) 04:22:58 INFO - PROCESS | 17098 | __metrics Screen width/height:1600/1200 04:22:58 INFO - PROCESS | 17098 | colorDepth:24 04:22:58 INFO - PROCESS | 17098 | Browser inner width/height: 1024/697 04:22:58 INFO - PROCESS | 17098 | __metrics 04:22:59 INFO - PROCESS | 17098 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 04:22:59 INFO - PROCESS | 17098 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:23:00 INFO - PROCESS | 17098 | console.error: PushService: 04:23:00 INFO - PROCESS | 17098 | stateChangeProcessEnqueue: Error transitioning state 04:23:00 INFO - PROCESS | 17098 | UnknownError 04:23:00 INFO - TEST-INFO | 17098: exit 0 04:23:00 INFO - Browser initialized. 04:23:00 INFO - Running cycle 1/1 for dromaeo_css test... 04:23:00 INFO - TEST-INFO | started process 17183 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpaNkMS3/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:23:12 INFO - PROCESS | 17183 | RSS: Main: 158007296 04:23:12 INFO - PROCESS | 17183 | 04:24:03 INFO - PROCESS | 17183 | 1468668243730 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] 04:26:11 INFO - PROCESS | 17183 | Cycle 1(1): loaded http://localhost:46728/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46728/tests/dromaeo/cssquery-ext.html) 04:26:12 INFO - PROCESS | 17183 | RSS: Main: 262455296 04:26:12 INFO - PROCESS | 17183 | 04:29:14 INFO - PROCESS | 17183 | Cycle 1(1): loaded http://localhost:46728/tests/dromaeo/cssquery-ext.html (next: http://localhost:46728/tests/dromaeo/cssquery-jquery.html) 04:29:15 INFO - PROCESS | 17183 | RSS: Main: 238964736 04:29:15 INFO - PROCESS | 17183 | 04:32:17 INFO - PROCESS | 17183 | Cycle 1(1): loaded http://localhost:46728/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46728/tests/dromaeo/cssquery-mootools.html) 04:32:17 INFO - PROCESS | 17183 | RSS: Main: 231874560 04:32:17 INFO - PROCESS | 17183 | 04:35:19 INFO - PROCESS | 17183 | Cycle 1(1): loaded http://localhost:46728/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46728/tests/dromaeo/cssquery-prototype.html) 04:35:20 INFO - PROCESS | 17183 | RSS: Main: 240893952 04:35:20 INFO - PROCESS | 17183 | 04:38:23 INFO - PROCESS | 17183 | Cycle 1(1): loaded http://localhost:46728/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46728/tests/dromaeo/cssquery-yui.html) 04:38:23 INFO - PROCESS | 17183 | RSS: Main: 228392960 04:38:23 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | Cycle 1(1): loaded http://localhost:46728/tests/dromaeo/cssquery-yui.html (next: http://localhost:46728/tests/dromaeo/cssquery-dojo.html) 04:41:26 INFO - PROCESS | 17183 | RSS: Main: 267956224 04:41:26 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | __start_tp_report 04:41:26 INFO - PROCESS | 17183 | _x_x_mozilla_page_load 04:41:26 INFO - PROCESS | 17183 | _x_x_mozilla_page_load_details 04:41:26 INFO - PROCESS | 17183 | |i|pagename|runs| 04:41:26 INFO - PROCESS | 17183 | |0;dojo.html;3007.293286077772;3036.969630303699;3060.999999999999;3066.1414803854927;3076.753859691225;5221.712805795689;5285.101532739434;5303.840884773454;5393.487618676224;5409.242706021155;5310.176922577007;5327.334083239595;5363.570914326844;5376.569874410047;5445.128779395298;4735.408073990751;4801.399825021872;4816.879578010543;4829.565339119478;4923.18767403378;4826.420829500465;4831.0820944020525;4858.951410485885;4868.513148685139;4899.118158731427;4693.9061218775605;4771.141194584973;4785.856424307259;4826.276058591205;4842.467328593887;4809.23052311632;4874.707517548958;4889.07107649549;4895.730734809584;4919.704817710949;4661.370714953472;4778.761061946889;4857.73282469464;4898.804047838083;4928.852134435937;5342.91985620216;5376.865578360533;5422.0511410503;5430.104032834578;5439.456054394568;5740.54075673945;5760.53915686744;5767.4520920512905;5791.218185544982;5792.478676919098;5561.638493497951;5671.06427439472;5698.287714035746;5765.106408506688;5785.421457854223;5402.702851343174;5433.375161856397;5435.809746658848;5437.075697131497;5442.482964118402;5917.201177840936;5920.052791553331;5927.585069045125;5929.911051334234;5931.555133364928;5439.374471935699;5498.890022199614;5500.50495455411;5517.089680202722;5684.090545512699;5657.094864821609;5696.3733989261145;5697.658140511499;5701.686407247641;5702.6293290935955;5641.605087643826;5641.8589535261945;5642.661440313512;5651.0675738503505;5652.660840349592;5604.3835178130375;5606.831795046155;5633.661980281115;5666.603337766317;5707.6290041147195;4364.148990946735;4364.214441400515;4369.4101296325225;4370.497392799805;4404.867853964386;3894.045958740127;3900.863469778544;3908.843646254118;3920.3531417316394;3969.186316805048;5285.788568457218;5312.468753124656;5330.280412144389;5379.838604841782;5416.729163541807;5696.6582005079;5717.371089180187;5720.856978575569;5729.71351432435;5741.339745929188;5247.632665713363;5342.145256758978;5406.945930540723;5419.160030195326;5421.864453388697;4921.680090794087;4941.629377796679;4958.454569997298;4959.20652695567;4999;5917;5932.0508718604815;5934;5937.70311484424;5938.762449502058;5571.60998730085;5704.286964129484;5744.080947048452;5754.827355179351;5781.768729250951;5970.402959703995;5978;5980.910286345621;5983.072623743326;5989.101634754822;5683.431656834284;5684.459976302244;5685.60200785941;5688.260526131577;5690.9430905690415;5594.216809646571;5705.686187259741;5733.913991290051;5757.193992841089;5788.507976822018;5671.404502527175;5673.574481913791;5679.204911312502;5680.147977803363;5681.687507187145;5583.944160558342;5627.43725627434;5632.802851900164;5635.549156067423;5657.519110875622;5434.157705555645;5498.80754173602;5520.475554822286;5545.1682247663175;5565.777368905198;5567.832965011056;5616.438356164351;5619.185218143264;5656.745446455002;5661.207430959586;5308.946910531;5481.287432633732;5483.369412517452;5485.204645326326;5492.286002819767 04:41:26 INFO - PROCESS | 17183 | |1;ext.html;580.1355979590409;595.300521886783;613.0773186354537;620.3145524195763;635.5805168588732;31497;32143.35713285736;34951.475727864105;35019.47470787937;43919.56080439195;43164.784176079156;48316;48370.51629483704;48453.757731211386;48458.75770621151;8893.466392016484;9019.188273055424;9022.54887255638;9030.729078127666;9030.86453703195;8897.199252067312;8912.287017038654;8986.191242788147;8994.415363001417;8996.145366190201;9050.77373065672;9081.18269355758;9084.40951338161;9087.727368178932;9090.13643703847;8996.370254082183;9040.638374465014;9059.776930114416;9060.864087038699;9062.637494500244;8826.514541700204;8910;8919.24186444153;8922.553872306358;8927.508987005713;44236.3364549532;44278.11443771107;44570.55429445697;44577.33134002992;44585.3312200314;3335.633080361158;3510.4558793387064;3666.6150054244454;3817.2365526894732;3839.827207775657;33513.83243083793;34190.316193675986;34210.82894585536;34364.48453273203;34367.140821479414;4084.4485994390675;4100.5489396166395;4113.71204015719;4166.812493437772;4175.749455032707;367849;369133;370495;370569;370985.9999999973;51955;59386;59985.40014599886;60004.39995600076;60025.09962350568;52431.73784131131;57718.422815772145;57957;68105.65947170331;69808;16727.414540491023;17264.482065537803;17275.222614982355;17294.567635808955;17299.394521191698;13310.933445332712;13426.328683565782;13433;13497.595072147851;13528.797068043987;15604.375824966874;17169.31322747101;17508.649827003388;17975.472084872672;18048.187831547348;6325.810225693236;6467.741290348334;6475;6516.706748196342;6518.28298887122;1031.4533297352416;1068.1935138970184;1099.428297285407;1106.5407855739777;1141.49774099396;33421.498677519856;33422.66577334244;34053.31893362168;34171.487427688604;34588;1092.1754075672816;1105.6406667832987;1114.1142791480793;1127.8590176227972;1173.966909119986;18129.728054079198;18716.719249211274;18878.52803679919;19501.707474387895;19784.90107549453;582821;586467;588266;590239;592442;61157.69421152866;61300;61670.38329616647;61738;61831.381686183464;1353.6683512539294;1364.7134101838526;1378.3659516622265;1395.6720170759863;1401.593537874005;33211.16972075718;34094.48858267177;34895.30209395747;34968;35066.298674025864;53427.46572534225;53709;53866.73066634798;53869;53933;364065;364280;364757;365013;369843;25346.366340841625;27669.446611067262;28483.715162848108;28732.85633571819;29143.125706228846;49512;49537.50462495329;49613.75193124011;50384.49615503798;51130;41890.79054604707;42335.576644234396;42349.36475952801;42600.360994585724;43727.56272437235;42156.57843421649;42204;42396.57603423926;42419.57580424156;42982.35526467043;42072;42806.35790463208;42904;43120.35319470148;43359;36086.27827443489;37751.2449751009;37831.62168378281;37852.24295514129;38013;28718.569221462112;28950.710492895643;29256.853715732137;29281;29358.55962160612 04:41:26 INFO - PROCESS | 17183 | |2;jquery.html;386.6558762701196;390.7362530292052;392.83697265634765;397.992040159197;411.62747713319436;18293.26826926923;20785;20785.376438706826;21288.680669789945;21294.467638309052;19318;19810.60378792427;20023.499412514695;20207.69688454674;20315.796842031574;5752.367239603651;5893.55798315126;6205.100260462253;6620.271770105284;6632.204135503746;6336.651484168369;6585.80242592723;6610.140681711371;6616.834579135536;6654.70053847578;6534.085228068075;6561.245456772461;6567.573107748005;6574.0796288519405;6574.375434333754;6328.905066423984;6536.673166341688;6541.7710380136705;6614.570052946591;6618.801435956929;5811.506021988136;5813.47678708914;5820.708964551755;5823.883522329572;5837.9124313135335;24558.877205614037;25016.24951251447;25163.496730065297;25240.495190096095;25308.114216002352;2401.78383945444;2477.7646123618406;2487.1543675150356;2696.312440327704;2808.5225511663066;10088.798224035552;14826.184559849204;15053.623659408493;15115.16866572338;15329.846701533064;1904.6762050451318;1974.8518861085333;1981.0787983587702;1991.980080199194;2042.948926276855;81517.59241203815;81981.18018819795;83332.58333708353;83899.58050209771;83914.58042709809;11025.503852326665;11135.610253641245;11276.534050573373;11402.429878506042;11586.304821710724;15485.070895746067;15685;15709.371625135094;15726.29231684577;15734.606634833992;8296.460730052528;8435.620397082146;8484.660613575388;8565.743027709179;8583.699570515002;8172.6730930762105;8258.710945116893;8307.543085130255;8396.454230475;8403.159684031549;4711.387519622427;4812.735299558558;4824.951750482521;4828.734419606955;4939.87650308738;1916.4293160811565;1955.904693371688;1998.9500262493555;2001.4996250937265;2014.7179394884436;955.2071780422372;957.9856302155473;971.2424309038961;1029.0995379043336;1038.133158812385;18987.43037708871;20192;20759.377218683465;21258.468538286357;21647.89176054141;983.149575617086;1000.6097621927454;1010.6816352848829;1012.6556970630021;1058.5342449322275;10580.518727378174;11291.266067705574;11340.20618556693;11374.715632109099;11376.829347559793;470227;476990;477130;494829;511369;77751;96591.51704241434;99841.50079249557;100434.4978275104;104086.4795676032;1035.7203555040096;1040.079529616295;1050.2490719135856;1061.4533515239502;1071.2073065931154;14637.26813659334;17441.73837392415;18013.819861801214;18627.627447450704;19165.712514312574;41780.58219417888;43622.781886090364;44258.3361249588;44452.55547444484;44929.32606010847;57721;57896.42103579079;58409.70795145997;59803.70098149481;60232.09651855313;7294.927050729425;7624.809379765328;7646.847063058596;8401.07588165289;8728.956355218183;9597.376170548892;11960.46177922013;13212.603621891358;13233.470661173445;13300.334983250992;11792.587259445878;11840.822387664364;11862.347570883685;11977.700557486132;12226.266424014231;10961.123110151328;11460.828087578526;11559;11630;11641.41792910368;11766.764664706829;11820.231684940796;11885.940570297093;12208.511659533518;12253.632391028283;7587.165411804807;8342.249197572248;8581.485110893367;8745.47527148373;8798.516081615573;11389.373584452935;11464.94267528657;11535.077193824642;11795.174337796272;11944.820827687417 04:41:26 INFO - PROCESS | 17183 | |3;mootools.html;1495.8728508076817;1510.410939733504;1642.6468309313495;1749.2390809997644;1772.7695399598051;8571.271441927436;9148.542572871347;9179.586918588662;9196.0803919608;9198.080191980807;7836.255555722198;8514.403991720583;8733.170348816868;8781.7804554886;9016.68441604544;2338.403707054703;2348.4363752699314;2360.126753101355;2363.7163540375177;2368.455255291284;2324.6164382876805;2335.976640233593;2383.8212134089927;2385.689860318165;2386.8209884258663;2063.298478517304;2125.2136709417537;2129.861558998668;2136.1562182937732;2258.435391152212;2339.6841426407473;2374.2877136858874;2375.085592047057;2385.7614238576175;2388.1044608271723;2314.7338056123594;2321.651752237161;2341.1454818991115;2350.8707021113833;2352.8235382346393;9134.269258459308;9150.222231110363;9178.311626627963;9190;9192.770180745469;5195.402528709171;5343;5399.514043736082;5411.2965314508865;5416.350037995466;3334.433146365124;3391.1522119470133;3482.077249528877;3496.3531746626954;3499.790012599227;1163.3252713426193;1188.3701638131804;1205.1985429689246;1221.5663439478947;1226.5277868020787;12615.558455454107;12632.873671263262;12645.873541264562;12653.683657908627;12656.6835829105;4522.140793249272;4672.159011377917;4685.81256749733;4791.161546729378;4795.472498025214;10657;10684.25210235276;10690.358578485315;10697.786044279072;10698.51856666452;5345.705986170798;5359.544438722674;5361.222622719683;5363.651362661414;5366.0877650798675;4757.833475828329;4877.6829506081995;4927.802887884516;4950.455449900508;4955.950440495621;3844.9231015379537;3891.124496988155;3965;3985.501812273466;3997.7401468904427;1169.5088063013554;1172.3903570143477;1181.4506254591483;1192.0404074719934;1198.7302856857136;853.1042405474227;853.6884037326331;998.1964518562627;1028.1928685981468;1037.0666400239845;6195.783147589813;6349.809505714744;6407.679616019273;6437.710303036374;6494.870102597922;505.3834322126999;514.4752352600327;517.7488917874828;522.2218893848138;665.2781731820932;4250.574942505725;4499.910001799945;4517.954820451753;4577.8168873244695;4587.518310577341;10672.092872105957;11167.106631469464;11198.664040078811;11203.495842687098;11213.159013074051;9905.653302134391;10402.635907743344;10914.617988370368;11131.610393636345;11132.387718675389;8377.539235342114;8455.196756308142;8487.533185674847;8522.57387130641;8537.871931921027;6143.447089761943;6340.809775706736;6364.109024736448;6443.67781610927;6545.5090868184125;9966.152877005246;10161.441120738431;10203.642872499428;10347.84478232812;10352.482375881327;10460.790784184426;10464.424456654653;10485.842712359474;10519.737006574896;10604.416757078126;7554.924450755422;7629.618519074135;7632.236776322324;7634.198409166957;7636.618169091635;8490.15098490146;8511.95744021276;8569.271611913056;8593.710943358547;8608.053114157563;7828.960855195687;7867.8819817703925;7883.7240696575345;7909.05091389037;7943.324817390587;7506.061742282215;7510.887336690063;7717.961410192913;7733.729319473791;7777.766666999999;7299.598522081124;7362.6318684066655;7362.815929601588;7370.152432470334;7392.778216653509;5282.418933917343;5370.516653501204;5475.698836564027;5547.1679248111495;5580.162975553537;5431.83704488866;5589.692566908859;5590.8043218487155;5655.208270842003;5786 04:41:26 INFO - PROCESS | 17183 | |4;prototype.html;323.82837096338943;324.6882594318952;332.6507167474152;333.8581103031211;334.24794213020704;5383.81156659517;5391.32608423947;5396.3524377074755;5398.352197736277;5451.509364157225;5305.761240744167;5325.520703136717;5363.846772943816;5372.382176049756;5378.273933019051;3980.4626375439234;4073.2464494068545;4144.606262405066;4175.832966681329;4194.224068547313;4103.871435355286;4131.917361652765;4136.296829538971;4157.293260145782;4167.687423443239;3976.16500534888;4137.8965525861795;4151.190517849021;4161.771102589357;4172.04043070094;4064.634182923536;4127.587241275848;4131.338985762263;4140.399642051901;4150.294449943517;3662.267546490686;3664.8534058637624;3669.94495082574;3676.7793932364143;3686.7603605765808;5228.503292187236;5228.869278268074;5254.21186821976;5257.63301541602;5264.842054738326;4572.839950601713;4752.572268495817;4759.643501602027;4808.879778005543;4817.710937343771;5564.916526252109;5584.687598414369;5590.301212348457;5594.356648985378;5628.943710562883;3840.8463661453507;4000.6799456043445;4017.5580686124504;4035.1122752994293;4061.959380406188;5807.593468457209;5818.8254352369495;5830;5831.4168583141345;5843.620164689281;4132.73137246078;4144.109016561454;4149.190907773016;4155.439015732837;4156.542780294165;4071.42999980003;4177.352510360899;4224.429701990253;4226.302660061056;4232.597903199191;4747.216709243005;4783.115123702057;4793.13723529768;4798.352222449995;4804.42346918365;5640.943590564124;5666;5670.376258611549;5670.858228544319;5695.515881150149;1392.9024968252124;1410.703752212047;1411.708286917459;1424.3803945283835;1428.7642538980951;897.2373482539789;899.4603238057114;941.5433514745343;954.160338901762;969.0987381734914;5334.866628334245;5343.5190832824455;5372.543333816591;5416.91874621881;5457.263269458573;5704.258446402024;5741.626794258444;5745.626534275342;5765.385692006245;5780.1907732917425;5231.503007214308;5449;5495.807646732425;5564.136014435128;5588.552915766729;3084.259777653347;3090.629124505029;3099.9380012399624;3107.1610665120293;3127.03062050765;5850.444207800252;5999.850003749942;6010.218671572755;6038.909416358758;6049.669072803976;5901.645901245939;5916.585838991229;5917.467427931507;5930.043085781682;5936.1986131871645;5994.340622531518;6005.6396616203165;6007.969960150172;6008.999999999913;6049.8487537811025;5621.297337832771;5721.685307308138;5734.311882574118;5747.453991870766;5768.94231057684;5685.971570142123;5702.6863522506665;5715.885682286248;5749.9712501437225;5753.4246575343805;5686.658800471985;5939.4951429129005;5940.762369505172;5970.716295996208;5985.772916552183;4092.2633925892433;4104.610062044101;4113.444684967491;4127.566605506378;4130.483689538808;5846.047745888299;5898.35118136996;5915.438033386821;5915.91126133117;5920.407959204045;5623.297087864017;5632.521235694848;5635.633683810539;5669.603127781016;5779;5589.776408943597;5627;5632.746526406403;5639.238702775073;5662.377138514677;5427.6200665953;5525.557955363642;5597.888042239214;5640.774369025357;5715.114157305624;5618.185363122243;5640.097584386478;5668.489835914787;5678.488935995781;5717.342505611908;5477.1510415885605;5579.637323573955;5623.2408624835125;5625.481120097633;5640.661560306395 04:41:26 INFO - PROCESS | 17183 | |5;yui.html;712.5653351455612;722.2632914427281;744.3040756892302;776.3439893290168;799.0451410564374;15928.68142637148;17025.06362150084;17060.573485662866;17115;17267;11597.65207043788;15262.542123736277;15340;15415;15422.460213892517;793.9325157361617;822.3051521464353;822.461287856455;825.2572684583863;825.413956091176;819.7704642700054;831.9168083191693;832.7168762620707;832.9167083291683;833.1335411172373;715.4097869257857;852.228732996639;867.3364875869964;870.4559650218613;871.0375035585681;842.4566154830162;843.28320927212;843.4011851585382;844.1684940333766;860.2515811244226;612.8375980365207;614.4715544631613;615.5444970721634;617.299365220478;620.1503939602773;15435.536933892;15456.845431545766;15468.226588670634;15475.535733928;15476.922615386851;14833.55499335011;14860.182689952047;14875.702485950329;14928.70142597142;15092.245387730569;13717.245551494663;13752;13755.518556850562;13835.79246311306;14178;3578.785272883635;3688.6680198782237;3756.849726010956;3850.114473671071;4485.529019452975;87366;88203.99999999936;88545;88727.11272887318;90494;11514.136439766884;11584.826227606593;11596.94201528987;11684.474198660911;11743.17797754149;22138.557228855334;22154.44613884666;22155.224567140394;22164.445888852584;22180.112795488323;8288.668453261922;8429.915700843036;8476.660933562713;8822.911770882209;8898.911010889939;4348.260795664744;4362.520122786491;4381.364702118175;4523.819047238139;4606.539346065434;3427.4002049641213;3533.5759708835103;3543.291341731664;3548.7515873889097;3554.0581745837376;623.2769986815273;641.1568787045021;668.301624802083;692.1071817355555;695.391532409142;681.802277339566;694.7880896326669;737.5206116024519;738.0110651726712;748.7753673897809;10036.799264014679;10115.494225288707;10238.897611023795;10354.17166626668;10471.109955653856;660.5145218264572;672.5964421347153;695.3113731653626;697.4106879686657;709.6097146569366;4551.294549344857;4656.4877863434995;4703.905921881543;4825.95174048262;4880.438749543777;134875;135095;135260;135285;135334;68301;106735.4663226679;111431;112115.43942280236;114310.42844785722;100659;103264.48367758113;104320.47839760753;105585;106950.46524767326;9174.449533028039;9482.525873706425;9492.620295188115;9551.665691700757;9569.952150239204;58274.4172558269;58753.70623146857;59427.40572594219;59548.70225648844;59582.40417595769;59818;83807;85348.57325713332;86962.56518717366;87263.56368218118;11525.654230373102;11712.941435292769;11861.76276474483;12012.879871201525;12170.939145304217;13382.531611393555;13452.865471345553;14594;14670.853291466949;15222.010569312959;14615.170327920689;14877.47928822486;14967;15237.238138093273;15311.923440382727;13305.334733263491;13385.397657105648;13625.28001903157;13982.230977296347;14353.64115897111;13542;13880.305984700926;13979.440822367398;14464;14549.376797698962;10653.360798352123;10789.406582637715;10999.725006874573;11670.299782013106;11790.292582445081;11767.52929882795;12321.322327272086;12477.313747743598;12729;13192.73614527685 04:41:26 INFO - PROCESS | 17183 | __end_tp_report 04:41:26 INFO - PROCESS | 17183 | __start_cc_report 04:41:26 INFO - PROCESS | 17183 | _x_x_mozilla_cycle_collect,874 04:41:26 INFO - PROCESS | 17183 | __end_cc_report 04:41:26 INFO - PROCESS | 17183 | __startTimestamp1468669286664__endTimestamp 04:41:26 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | ------- Summary: start ------- 04:41:26 INFO - PROCESS | 17183 | Number of tests: 6 04:41:26 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | [#0] dojo.html Cycles:165 Average:5310.19 Median:5498.81 stddev:612.70 (11.1%) stddev-sans-first:587.35 04:41:26 INFO - PROCESS | 17183 | Values: 3007.3 3037.0 3061.0 3066.1 3076.8 5221.7 5285.1 5303.8 5393.5 5409.2 5310.2 5327.3 5363.6 5376.6 5445.1 4735.4 4801.4 4816.9 4829.6 4923.2 4826.4 4831.1 4859.0 4868.5 4899.1 4693.9 4771.1 4785.9 4826.3 4842.5 4809.2 4874.7 4889.1 4895.7 4919.7 4661.4 4778.8 4857.7 4898.8 4928.9 5342.9 5376.9 5422.1 5430.1 5439.5 5740.5 5760.5 5767.5 5791.2 5792.5 5561.6 5671.1 5698.3 5765.1 5785.4 5402.7 5433.4 5435.8 5437.1 5442.5 5917.2 5920.1 5927.6 5929.9 5931.6 5439.4 5498.9 5500.5 5517.1 5684.1 5657.1 5696.4 5697.7 5701.7 5702.6 5641.6 5641.9 5642.7 5651.1 5652.7 5604.4 5606.8 5633.7 5666.6 5707.6 4364.1 4364.2 4369.4 4370.5 4404.9 3894.0 3900.9 3908.8 3920.4 3969.2 5285.8 5312.5 5330.3 5379.8 5416.7 5696.7 5717.4 5720.9 5729.7 5741.3 5247.6 5342.1 5406.9 5419.2 5421.9 4921.7 4941.6 4958.5 4959.2 4999.0 5917.0 5932.1 5934.0 5937.7 5938.8 5571.6 5704.3 5744.1 5754.8 5781.8 5970.4 5978.0 5980.9 5983.1 5989.1 5683.4 5684.5 5685.6 5688.3 5690.9 5594.2 5705.7 5733.9 5757.2 5788.5 5671.4 5673.6 5679.2 5680.1 5681.7 5583.9 5627.4 5632.8 5635.5 5657.5 5434.2 5498.8 5520.5 5545.2 5565.8 5567.8 5616.4 5619.2 5656.7 5661.2 5308.9 5481.3 5483.4 5485.2 5492.3 04:41:26 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | [#1] ext.html Cycles:180 Average:60853.09 Median:42114.29 stddev:120335.15 (285.7%) stddev-sans-first:120587.63 04:41:26 INFO - PROCESS | 17183 | Values: 580.1 595.3 613.1 620.3 635.6 31497.0 32143.4 34951.5 35019.5 43919.6 43164.8 48316.0 48370.5 48453.8 48458.8 8893.5 9019.2 9022.5 9030.7 9030.9 8897.2 8912.3 8986.2 8994.4 8996.1 9050.8 9081.2 9084.4 9087.7 9090.1 8996.4 9040.6 9059.8 9060.9 9062.6 8826.5 8910.0 8919.2 8922.6 8927.5 44236.3 44278.1 44570.6 44577.3 44585.3 3335.6 3510.5 3666.6 3817.2 3839.8 33513.8 34190.3 34210.8 34364.5 34367.1 4084.4 4100.5 4113.7 4166.8 4175.7 367849.0 369133.0 370495.0 370569.0 370986.0 51955.0 59386.0 59985.4 60004.4 60025.1 52431.7 57718.4 57957.0 68105.7 69808.0 16727.4 17264.5 17275.2 17294.6 17299.4 13310.9 13426.3 13433.0 13497.6 13528.8 15604.4 17169.3 17508.6 17975.5 18048.2 6325.8 6467.7 6475.0 6516.7 6518.3 1031.5 1068.2 1099.4 1106.5 1141.5 33421.5 33422.7 34053.3 34171.5 34588.0 1092.2 1105.6 1114.1 1127.9 1174.0 18129.7 18716.7 18878.5 19501.7 19784.9 582821.0 586467.0 588266.0 590239.0 592442.0 61157.7 61300.0 61670.4 61738.0 61831.4 1353.7 1364.7 1378.4 1395.7 1401.6 33211.2 34094.5 34895.3 34968.0 35066.3 53427.5 53709.0 53866.7 53869.0 53933.0 364065.0 364280.0 364757.0 365013.0 369843.0 25346.4 27669.4 28483.7 28732.9 29143.1 49512.0 49537.5 49613.8 50384.5 51130.0 41890.8 42335.6 42349.4 42600.4 43727.6 42156.6 42204.0 42396.6 42419.6 42982.4 42072.0 42806.4 42904.0 43120.4 43359.0 36086.3 37751.2 37831.6 37852.2 38013.0 28718.6 28950.7 29256.9 29281.0 29358.6 04:41:26 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | [#2] jquery.html Cycles:180 Average:29504.22 Median:13751.70 stddev:80293.93 (583.9%) stddev-sans-first:80489.41 04:41:26 INFO - PROCESS | 17183 | Values: 386.7 390.7 392.8 398.0 411.6 18293.3 20785.0 20785.4 21288.7 21294.5 19318.0 19810.6 20023.5 20207.7 20315.8 5752.4 5893.6 6205.1 6620.3 6632.2 6336.7 6585.8 6610.1 6616.8 6654.7 6534.1 6561.2 6567.6 6574.1 6574.4 6328.9 6536.7 6541.8 6614.6 6618.8 5811.5 5813.5 5820.7 5823.9 5837.9 24558.9 25016.2 25163.5 25240.5 25308.1 2401.8 2477.8 2487.2 2696.3 2808.5 10088.8 14826.2 15053.6 15115.2 15329.8 1904.7 1974.9 1981.1 1992.0 2042.9 81517.6 81981.2 83332.6 83899.6 83914.6 11025.5 11135.6 11276.5 11402.4 11586.3 15485.1 15685.0 15709.4 15726.3 15734.6 8296.5 8435.6 8484.7 8565.7 8583.7 8172.7 8258.7 8307.5 8396.5 8403.2 4711.4 4812.7 4825.0 4828.7 4939.9 1916.4 1955.9 1999.0 2001.5 2014.7 955.2 958.0 971.2 1029.1 1038.1 18987.4 20192.0 20759.4 21258.5 21647.9 983.1 1000.6 1010.7 1012.7 1058.5 10580.5 11291.3 11340.2 11374.7 11376.8 470227.0 476990.0 477130.0 494829.0 511369.0 77751.0 96591.5 99841.5 100434.5 104086.5 1035.7 1040.1 1050.2 1061.5 1071.2 14637.3 17441.7 18013.8 18627.6 19165.7 41780.6 43622.8 44258.3 44452.6 44929.3 57721.0 57896.4 58409.7 59803.7 60232.1 7294.9 7624.8 7646.8 8401.1 8729.0 9597.4 11960.5 13212.6 13233.5 13300.3 11792.6 11840.8 11862.3 11977.7 12226.3 10961.1 11460.8 11559.0 11630.0 11641.4 11766.8 11820.2 11885.9 12208.5 12253.6 7587.2 8342.2 8581.5 8745.5 8798.5 11389.4 11464.9 11535.1 11795.2 11944.8 04:41:26 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | [#3] mootools.html Cycles:180 Average:5923.13 Median:4836.58 stddev:3375.90 (69.8%) stddev-sans-first:3368.98 04:41:26 INFO - PROCESS | 17183 | Values: 1495.9 1510.4 1642.6 1749.2 1772.8 8571.3 9148.5 9179.6 9196.1 9198.1 7836.3 8514.4 8733.2 8781.8 9016.7 2338.4 2348.4 2360.1 2363.7 2368.5 2324.6 2336.0 2383.8 2385.7 2386.8 2063.3 2125.2 2129.9 2136.2 2258.4 2339.7 2374.3 2375.1 2385.8 2388.1 2314.7 2321.7 2341.1 2350.9 2352.8 9134.3 9150.2 9178.3 9190.0 9192.8 5195.4 5343.0 5399.5 5411.3 5416.4 3334.4 3391.2 3482.1 3496.4 3499.8 1163.3 1188.4 1205.2 1221.6 1226.5 12615.6 12632.9 12645.9 12653.7 12656.7 4522.1 4672.2 4685.8 4791.2 4795.5 10657.0 10684.3 10690.4 10697.8 10698.5 5345.7 5359.5 5361.2 5363.7 5366.1 4757.8 4877.7 4927.8 4950.5 4956.0 3844.9 3891.1 3965.0 3985.5 3997.7 1169.5 1172.4 1181.5 1192.0 1198.7 853.1 853.7 998.2 1028.2 1037.1 6195.8 6349.8 6407.7 6437.7 6494.9 505.4 514.5 517.7 522.2 665.3 4250.6 4499.9 4518.0 4577.8 4587.5 10672.1 11167.1 11198.7 11203.5 11213.2 9905.7 10402.6 10914.6 11131.6 11132.4 8377.5 8455.2 8487.5 8522.6 8537.9 6143.4 6340.8 6364.1 6443.7 6545.5 9966.2 10161.4 10203.6 10347.8 10352.5 10460.8 10464.4 10485.8 10519.7 10604.4 7554.9 7629.6 7632.2 7634.2 7636.6 8490.2 8512.0 8569.3 8593.7 8608.1 7829.0 7867.9 7883.7 7909.1 7943.3 7506.1 7510.9 7718.0 7733.7 7777.8 7299.6 7362.6 7362.8 7370.2 7392.8 5282.4 5370.5 5475.7 5547.2 5580.2 5431.8 5589.7 5590.8 5655.2 5786.0 04:41:26 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | [#4] prototype.html Cycles:180 Average:4747.20 Median:5450.25 stddev:1408.20 (25.8%) stddev-sans-first:1372.45 04:41:26 INFO - PROCESS | 17183 | Values: 323.8 324.7 332.7 333.9 334.2 5383.8 5391.3 5396.4 5398.4 5451.5 5305.8 5325.5 5363.8 5372.4 5378.3 3980.5 4073.2 4144.6 4175.8 4194.2 4103.9 4131.9 4136.3 4157.3 4167.7 3976.2 4137.9 4151.2 4161.8 4172.0 4064.6 4127.6 4131.3 4140.4 4150.3 3662.3 3664.9 3669.9 3676.8 3686.8 5228.5 5228.9 5254.2 5257.6 5264.8 4572.8 4752.6 4759.6 4808.9 4817.7 5564.9 5584.7 5590.3 5594.4 5628.9 3840.8 4000.7 4017.6 4035.1 4062.0 5807.6 5818.8 5830.0 5831.4 5843.6 4132.7 4144.1 4149.2 4155.4 4156.5 4071.4 4177.4 4224.4 4226.3 4232.6 4747.2 4783.1 4793.1 4798.4 4804.4 5640.9 5666.0 5670.4 5670.9 5695.5 1392.9 1410.7 1411.7 1424.4 1428.8 897.2 899.5 941.5 954.2 969.1 5334.9 5343.5 5372.5 5416.9 5457.3 5704.3 5741.6 5745.6 5765.4 5780.2 5231.5 5449.0 5495.8 5564.1 5588.6 3084.3 3090.6 3099.9 3107.2 3127.0 5850.4 5999.9 6010.2 6038.9 6049.7 5901.6 5916.6 5917.5 5930.0 5936.2 5994.3 6005.6 6008.0 6009.0 6049.8 5621.3 5721.7 5734.3 5747.5 5768.9 5686.0 5702.7 5715.9 5750.0 5753.4 5686.7 5939.5 5940.8 5970.7 5985.8 4092.3 4104.6 4113.4 4127.6 4130.5 5846.0 5898.4 5915.4 5915.9 5920.4 5623.3 5632.5 5635.6 5669.6 5779.0 5589.8 5627.0 5632.7 5639.2 5662.4 5427.6 5525.6 5597.9 5640.8 5715.1 5618.2 5640.1 5668.5 5678.5 5717.3 5477.2 5579.6 5623.2 5625.5 5640.7 04:41:26 INFO - PROCESS | 17183 | 04:41:26 INFO - PROCESS | 17183 | [#5] yui.html Cycles:180 Average:22890.35 Median:3538.43 stddev:34420.91 (972.8%) stddev-sans-first:34477.19 04:41:26 INFO - PROCESS | 17183 | Values: 712.6 722.3 744.3 776.3 799.0 15928.7 17025.1 17060.6 17115.0 17267.0 11597.7 15262.5 15340.0 15415.0 15422.5 793.9 822.3 822.5 825.3 825.4 819.8 831.9 832.7 832.9 833.1 715.4 852.2 867.3 870.5 871.0 842.5 843.3 843.4 844.2 860.3 612.8 614.5 615.5 617.3 620.2 15435.5 15456.8 15468.2 15475.5 15476.9 14833.6 14860.2 14875.7 14928.7 15092.2 13717.2 13752.0 13755.5 13835.8 14178.0 3578.8 3688.7 3756.8 3850.1 4485.5 87366.0 88204.0 88545.0 88727.1 90494.0 11514.1 11584.8 11596.9 11684.5 11743.2 22138.6 22154.4 22155.2 22164.4 22180.1 8288.7 8429.9 8476.7 8822.9 8898.9 4348.3 4362.5 4381.4 4523.8 4606.5 3427.4 3533.6 3543.3 3548.8 3554.1 623.3 641.2 668.3 692.1 695.4 681.8 694.8 737.5 738.0 748.8 10036.8 10115.5 10238.9 10354.2 10471.1 660.5 672.6 695.3 697.4 709.6 4551.3 4656.5 4703.9 4826.0 4880.4 134875.0 135095.0 135260.0 135285.0 135334.0 68301.0 106735.5 111431.0 112115.4 114310.4 100659.0 103264.5 104320.5 105585.0 106950.5 9174.4 9482.5 9492.6 9551.7 9570.0 58274.4 58753.7 59427.4 59548.7 59582.4 59818.0 83807.0 85348.6 86962.6 87263.6 11525.7 11712.9 11861.8 12012.9 12170.9 13382.5 13452.9 14594.0 14670.9 15222.0 14615.2 14877.5 14967.0 15237.2 15311.9 13305.3 13385.4 13625.3 13982.2 14353.6 13542.0 13880.3 13979.4 14464.0 14549.4 10653.4 10789.4 10999.7 11670.3 11790.3 11767.5 12321.3 12477.3 12729.0 13192.7 04:41:26 INFO - PROCESS | 17183 | -------- Summary: end -------- 04:41:26 INFO - PROCESS | 17183 | 04:41:27 INFO - TEST-INFO | 17183: exit 0 04:41:27 INFO - TEST-OK | dromaeo_css | took 1112601ms 04:41:27 INFO - TEST-START | kraken 04:41:27 INFO - operating with platform_type : linux_ 04:41:27 INFO - Initialising browser for kraken test... 04:41:27 INFO - TEST-INFO | started process 17369 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpF7s_2n/profile http://localhost:46728/getInfo.html) 04:41:31 INFO - PROCESS | 17369 | __metrics Screen width/height:1600/1200 04:41:31 INFO - PROCESS | 17369 | colorDepth:24 04:41:31 INFO - PROCESS | 17369 | Browser inner width/height: 1024/697 04:41:31 INFO - PROCESS | 17369 | __metrics 04:41:32 INFO - PROCESS | 17369 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 04:41:32 INFO - PROCESS | 17369 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:41:32 INFO - PROCESS | 17369 | console.error: PushService: 04:41:32 INFO - PROCESS | 17369 | stateChangeProcessEnqueue: Error transitioning state 04:41:32 INFO - PROCESS | 17369 | UnknownError 04:41:33 INFO - TEST-INFO | 17369: exit 0 04:41:33 INFO - Browser initialized. 04:41:33 INFO - Running cycle 1/1 for kraken test... 04:41:33 INFO - TEST-INFO | started process 17450 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpF7s_2n/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:41:45 INFO - PROCESS | 17450 | RSS: Main: 157872128 04:41:45 INFO - PROCESS | 17450 | 04:41:47 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46728/tests/kraken/driver.html?testName=audio-beat-detection) 04:41:48 INFO - PROCESS | 17450 | RSS: Main: 216735744 04:41:48 INFO - PROCESS | 17450 | 04:41:50 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46728/tests/kraken/driver.html?testName=audio-dft) 04:41:51 INFO - PROCESS | 17450 | RSS: Main: 204722176 04:41:51 INFO - PROCESS | 17450 | 04:41:54 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46728/tests/kraken/driver.html?testName=audio-fft) 04:41:55 INFO - PROCESS | 17450 | RSS: Main: 269217792 04:41:55 INFO - PROCESS | 17450 | 04:41:57 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46728/tests/kraken/driver.html?testName=audio-oscillator) 04:41:57 INFO - PROCESS | 17450 | RSS: Main: 180285440 04:41:57 INFO - PROCESS | 17450 | 04:42:00 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46728/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:42:00 INFO - PROCESS | 17450 | RSS: Main: 184664064 04:42:00 INFO - PROCESS | 17450 | 04:42:03 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46728/tests/kraken/driver.html?testName=imaging-darkroom) 04:42:04 INFO - PROCESS | 17450 | RSS: Main: 219746304 04:42:04 INFO - PROCESS | 17450 | 04:42:07 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46728/tests/kraken/driver.html?testName=imaging-desaturate) 04:42:08 INFO - PROCESS | 17450 | RSS: Main: 221437952 04:42:08 INFO - PROCESS | 17450 | 04:42:11 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46728/tests/kraken/driver.html?testName=json-parse-financial) 04:42:11 INFO - PROCESS | 17450 | RSS: Main: 221548544 04:42:11 INFO - PROCESS | 17450 | 04:42:13 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46728/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:42:13 INFO - PROCESS | 17450 | RSS: Main: 209985536 04:42:13 INFO - PROCESS | 17450 | 04:42:15 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46728/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:42:16 INFO - PROCESS | 17450 | RSS: Main: 213098496 04:42:16 INFO - PROCESS | 17450 | 04:42:18 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46728/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:42:18 INFO - PROCESS | 17450 | RSS: Main: 210665472 04:42:18 INFO - PROCESS | 17450 | 04:42:21 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46728/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:42:21 INFO - PROCESS | 17450 | RSS: Main: 224178176 04:42:21 INFO - PROCESS | 17450 | 04:42:24 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46728/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:42:25 INFO - PROCESS | 17450 | RSS: Main: 223268864 04:42:25 INFO - PROCESS | 17450 | 04:42:26 INFO - PROCESS | 17450 | Cycle 1(1): loaded http://localhost:46728/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46728/tests/kraken/driver.html?testName=ai-astar) 04:42:27 INFO - PROCESS | 17450 | RSS: Main: 265347072 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | __start_tp_report 04:42:27 INFO - PROCESS | 17450 | _x_x_mozilla_page_load 04:42:27 INFO - PROCESS | 17450 | _x_x_mozilla_page_load_details 04:42:27 INFO - PROCESS | 17450 | |i|pagename|runs| 04:42:27 INFO - PROCESS | 17450 | |0;ai-astar;101;111;110;111;110;111;109;110;110;110 04:42:27 INFO - PROCESS | 17450 | |1;audio-beat-detection;147;116;123;170;124;119;146;116;147;116 04:42:27 INFO - PROCESS | 17450 | |2;audio-dft;162;159;161;161;161;161;159;159;161;161 04:42:27 INFO - PROCESS | 17450 | |3;audio-fft;75;74;76;113;75;75;74;75;109;74 04:42:27 INFO - PROCESS | 17450 | |4;audio-oscillator;84;84;109;84;83;84;111;83;83;128 04:42:27 INFO - PROCESS | 17450 | |5;imaging-gaussian-blur;116;116;116;117;117;119;117;117;117;117 04:42:27 INFO - PROCESS | 17450 | |6;imaging-darkroom;145;148;146;145;146;147;146;147;146;146 04:42:27 INFO - PROCESS | 17450 | |7;imaging-desaturate;95;95;94;95;95;95;95;95;94;95 04:42:27 INFO - PROCESS | 17450 | |8;json-parse-financial;51;49;49;51;50;49;51;50;49;49 04:42:27 INFO - PROCESS | 17450 | |9;json-stringify-tinderbox;61;62;62;61;63;62;62;62;62;62 04:42:27 INFO - PROCESS | 17450 | |10;stanford-crypto-aes;76;75;78;75;76;75;83;74;74;75 04:42:27 INFO - PROCESS | 17450 | |11;stanford-crypto-ccm;123;116;132;120;129;118;126;119;163;121 04:42:27 INFO - PROCESS | 17450 | |12;stanford-crypto-pbkdf2;159;156;156;153;154;157;154;156;157;160 04:42:27 INFO - PROCESS | 17450 | |13;stanford-crypto-sha256-iterative;62;63;68;62;71;66;63;64;61;63 04:42:27 INFO - PROCESS | 17450 | __end_tp_report 04:42:27 INFO - PROCESS | 17450 | __start_cc_report 04:42:27 INFO - PROCESS | 17450 | _x_x_mozilla_cycle_collect,1643 04:42:27 INFO - PROCESS | 17450 | __end_cc_report 04:42:27 INFO - PROCESS | 17450 | __startTimestamp1468669347038__endTimestamp 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | ------- Summary: start ------- 04:42:27 INFO - PROCESS | 17450 | Number of tests: 14 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#0] ai-astar Cycles:10 Average:109.30 Median:110.00 stddev:2.98 (2.7%) stddev-sans-first:0.67 04:42:27 INFO - PROCESS | 17450 | Values: 101.0 111.0 110.0 111.0 110.0 111.0 109.0 110.0 110.0 110.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#1] audio-beat-detection Cycles:10 Average:132.40 Median:135.00 stddev:18.77 (13.9%) stddev-sans-first:19.15 04:42:27 INFO - PROCESS | 17450 | Values: 147.0 116.0 123.0 170.0 124.0 119.0 146.0 116.0 147.0 116.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#2] audio-dft Cycles:10 Average:160.50 Median:161.00 stddev:1.08 (0.7%) stddev-sans-first:1.00 04:42:27 INFO - PROCESS | 17450 | Values: 162.0 159.0 161.0 161.0 161.0 161.0 159.0 159.0 161.0 161.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#3] audio-fft Cycles:10 Average:82.00 Median:75.00 stddev:15.33 (20.4%) stddev-sans-first:16.05 04:42:27 INFO - PROCESS | 17450 | Values: 75.0 74.0 76.0 113.0 75.0 75.0 74.0 75.0 109.0 74.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#4] audio-oscillator Cycles:10 Average:93.30 Median:83.50 stddev:16.43 (19.7%) stddev-sans-first:17.07 04:42:27 INFO - PROCESS | 17450 | Values: 84.0 84.0 109.0 84.0 83.0 84.0 111.0 83.0 83.0 128.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.88 (0.7%) stddev-sans-first:0.87 04:42:27 INFO - PROCESS | 17450 | Values: 116.0 116.0 116.0 117.0 117.0 119.0 117.0 117.0 117.0 117.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:146.00 stddev:0.92 (0.6%) stddev-sans-first:0.87 04:42:27 INFO - PROCESS | 17450 | Values: 145.0 148.0 146.0 145.0 146.0 147.0 146.0 147.0 146.0 146.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#7] imaging-desaturate Cycles:10 Average:94.80 Median:95.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 04:42:27 INFO - PROCESS | 17450 | Values: 95.0 95.0 94.0 95.0 95.0 95.0 95.0 95.0 94.0 95.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#8] json-parse-financial Cycles:10 Average:49.80 Median:50.00 stddev:0.92 (1.8%) stddev-sans-first:0.87 04:42:27 INFO - PROCESS | 17450 | Values: 51.0 49.0 49.0 51.0 50.0 49.0 51.0 50.0 49.0 49.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#9] json-stringify-tinderbox Cycles:10 Average:61.90 Median:62.00 stddev:0.57 (0.9%) stddev-sans-first:0.50 04:42:27 INFO - PROCESS | 17450 | Values: 61.0 62.0 62.0 61.0 63.0 62.0 62.0 62.0 62.0 62.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#10] stanford-crypto-aes Cycles:10 Average:76.10 Median:75.50 stddev:2.69 (3.6%) stddev-sans-first:2.85 04:42:27 INFO - PROCESS | 17450 | Values: 76.0 75.0 78.0 75.0 76.0 75.0 83.0 74.0 74.0 75.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#11] stanford-crypto-ccm Cycles:10 Average:126.70 Median:124.50 stddev:13.71 (11.0%) stddev-sans-first:14.48 04:42:27 INFO - PROCESS | 17450 | Values: 123.0 116.0 132.0 120.0 129.0 118.0 126.0 119.0 163.0 121.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:156.20 Median:156.50 stddev:2.20 (1.4%) stddev-sans-first:2.09 04:42:27 INFO - PROCESS | 17450 | Values: 159.0 156.0 156.0 153.0 154.0 157.0 154.0 156.0 157.0 160.0 04:42:27 INFO - PROCESS | 17450 | 04:42:27 INFO - PROCESS | 17450 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.30 Median:63.50 stddev:3.13 (4.9%) stddev-sans-first:3.21 04:42:27 INFO - PROCESS | 17450 | Values: 62.0 63.0 68.0 62.0 71.0 66.0 63.0 64.0 61.0 63.0 04:42:27 INFO - PROCESS | 17450 | -------- Summary: end -------- 04:42:27 INFO - PROCESS | 17450 | 04:42:28 INFO - TEST-INFO | 17450: exit 0 04:42:28 INFO - TEST-OK | kraken | took 60678ms 04:42:28 INFO - SUITE-END | took 1173s 04:42:28 INFO - Completed test suite (00:19:33) 04:42:28 INFO - javascript benchmark 04:42:28 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3007.293286077772, 3036.969630303699, 3060.999999999999, 3066.1414803854927, 3076.753859691225, 5221.712805795689, 5285.101532739434, 5303.840884773454, 5393.487618676224, 5409.242706021155, 5310.176922577007, 5327.334083239595, 5363.570914326844, 5376.569874410047, 5445.128779395298, 4735.408073990751, 4801.399825021872, 4816.879578010543, 4829.565339119478, 4923.18767403378, 4826.420829500465, 4831.0820944020525, 4858.951410485885, 4868.513148685139, 4899.118158731427, 4693.9061218775605, 4771.141194584973, 4785.856424307259, 4826.276058591205, 4842.467328593887, 4809.23052311632, 4874.707517548958, 4889.07107649549, 4895.730734809584, 4919.704817710949, 4661.370714953472, 4778.761061946889, 4857.73282469464, 4898.804047838083, 4928.852134435937, 5342.91985620216, 5376.865578360533, 5422.0511410503, 5430.104032834578, 5439.456054394568, 5740.54075673945, 5760.53915686744, 5767.4520920512905, 5791.218185544982, 5792.478676919098, 5561.638493497951, 5671.06427439472, 5698.287714035746, 5765.106408506688, 5785.421457854223, 5402.702851343174, 5433.375161856397, 5435.809746658848, 5437.075697131497, 5442.482964118402, 5917.201177840936, 5920.052791553331, 5927.585069045125, 5929.911051334234, 5931.555133364928, 5439.374471935699, 5498.890022199614, 5500.50495455411, 5517.089680202722, 5684.090545512699, 5657.094864821609, 5696.3733989261145, 5697.658140511499, 5701.686407247641, 5702.6293290935955, 5641.605087643826, 5641.8589535261945, 5642.661440313512, 5651.0675738503505, 5652.660840349592, 5604.3835178130375, 5606.831795046155, 5633.661980281115, 5666.603337766317, 5707.6290041147195, 4364.148990946735, 4364.214441400515, 4369.4101296325225, 4370.497392799805, 4404.867853964386, 3894.045958740127, 3900.863469778544, 3908.843646254118, 3920.3531417316394, 3969.186316805048, 5285.788568457218, 5312.468753124656, 5330.280412144389, 5379.838604841782, 5416.729163541807, 5696.6582005079, 5717.371089180187, 5720.856978575569, 5729.71351432435, 5741.339745929188, 5247.632665713363, 5342.145256758978, 5406.945930540723, 5419.160030195326, 5421.864453388697, 4921.680090794087, 4941.629377796679, 4958.454569997298, 4959.20652695567, 4999.0, 5917.0, 5932.0508718604815, 5934.0, 5937.70311484424, 5938.762449502058, 5571.60998730085, 5704.286964129484, 5744.080947048452, 5754.827355179351, 5781.768729250951, 5970.402959703995, 5978.0, 5980.910286345621, 5983.072623743326, 5989.101634754822, 5683.431656834284, 5684.459976302244, 5685.60200785941, 5688.260526131577, 5690.9430905690415, 5594.216809646571, 5705.686187259741, 5733.913991290051, 5757.193992841089, 5788.507976822018, 5671.404502527175, 5673.574481913791, 5679.204911312502, 5680.147977803363, 5681.687507187145, 5583.944160558342, 5627.43725627434, 5632.802851900164, 5635.549156067423, 5657.519110875622, 5434.157705555645, 5498.80754173602, 5520.475554822286, 5545.1682247663175, 5565.777368905198, 5567.832965011056, 5616.438356164351, 5619.185218143264, 5656.745446455002, 5661.207430959586, 5308.946910531, 5481.287432633732, 5483.369412517452, 5485.204645326326, 5492.286002819767], "value": 5267.979925007104, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [580.1355979590409, 595.300521886783, 613.0773186354537, 620.3145524195763, 635.5805168588732, 31497.0, 32143.35713285736, 34951.475727864105, 35019.47470787937, 43919.56080439195, 43164.784176079156, 48316.0, 48370.51629483704, 48453.757731211386, 48458.75770621151, 8893.466392016484, 9019.188273055424, 9022.54887255638, 9030.729078127666, 9030.86453703195, 8897.199252067312, 8912.287017038654, 8986.191242788147, 8994.415363001417, 8996.145366190201, 9050.77373065672, 9081.18269355758, 9084.40951338161, 9087.727368178932, 9090.13643703847, 8996.370254082183, 9040.638374465014, 9059.776930114416, 9060.864087038699, 9062.637494500244, 8826.514541700204, 8910.0, 8919.24186444153, 8922.553872306358, 8927.508987005713, 44236.3364549532, 44278.11443771107, 44570.55429445697, 44577.33134002992, 44585.3312200314, 3335.633080361158, 3510.4558793387064, 3666.6150054244454, 3817.2365526894732, 3839.827207775657, 33513.83243083793, 34190.316193675986, 34210.82894585536, 34364.48453273203, 34367.140821479414, 4084.4485994390675, 4100.5489396166395, 4113.71204015719, 4166.812493437772, 4175.749455032707, 367849.0, 369133.0, 370495.0, 370569.0, 370985.9999999973, 51955.0, 59386.0, 59985.40014599886, 60004.39995600076, 60025.09962350568, 52431.73784131131, 57718.422815772145, 57957.0, 68105.65947170331, 69808.0, 16727.414540491023, 17264.482065537803, 17275.222614982355, 17294.567635808955, 17299.394521191698, 13310.933445332712, 13426.328683565782, 13433.0, 13497.595072147851, 13528.797068043987, 15604.375824966874, 17169.31322747101, 17508.649827003388, 17975.472084872672, 18048.187831547348, 6325.810225693236, 6467.741290348334, 6475.0, 6516.706748196342, 6518.28298887122, 1031.4533297352416, 1068.1935138970184, 1099.428297285407, 1106.5407855739777, 1141.49774099396, 33421.498677519856, 33422.66577334244, 34053.31893362168, 34171.487427688604, 34588.0, 1092.1754075672816, 1105.6406667832987, 1114.1142791480793, 1127.8590176227972, 1173.966909119986, 18129.728054079198, 18716.719249211274, 18878.52803679919, 19501.707474387895, 19784.90107549453, 582821.0, 586467.0, 588266.0, 590239.0, 592442.0, 61157.69421152866, 61300.0, 61670.38329616647, 61738.0, 61831.381686183464, 1353.6683512539294, 1364.7134101838526, 1378.3659516622265, 1395.6720170759863, 1401.593537874005, 33211.16972075718, 34094.48858267177, 34895.30209395747, 34968.0, 35066.298674025864, 53427.46572534225, 53709.0, 53866.73066634798, 53869.0, 53933.0, 364065.0, 364280.0, 364757.0, 365013.0, 369843.0, 25346.366340841625, 27669.446611067262, 28483.715162848108, 28732.85633571819, 29143.125706228846, 49512.0, 49537.50462495329, 49613.75193124011, 50384.49615503798, 51130.0, 41890.79054604707, 42335.576644234396, 42349.36475952801, 42600.360994585724, 43727.56272437235, 42156.57843421649, 42204.0, 42396.57603423926, 42419.57580424156, 42982.35526467043, 42072.0, 42806.35790463208, 42904.0, 43120.35319470148, 43359.0, 36086.27827443489, 37751.2449751009, 37831.62168378281, 37852.24295514129, 38013.0, 28718.569221462112, 28950.710492895643, 29256.853715732137, 29281.0, 29358.55962160612], "value": 20426.95430705687, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [386.6558762701196, 390.7362530292052, 392.83697265634765, 397.992040159197, 411.62747713319436, 18293.26826926923, 20785.0, 20785.376438706826, 21288.680669789945, 21294.467638309052, 19318.0, 19810.60378792427, 20023.499412514695, 20207.69688454674, 20315.796842031574, 5752.367239603651, 5893.55798315126, 6205.100260462253, 6620.271770105284, 6632.204135503746, 6336.651484168369, 6585.80242592723, 6610.140681711371, 6616.834579135536, 6654.70053847578, 6534.085228068075, 6561.245456772461, 6567.573107748005, 6574.0796288519405, 6574.375434333754, 6328.905066423984, 6536.673166341688, 6541.7710380136705, 6614.570052946591, 6618.801435956929, 5811.506021988136, 5813.47678708914, 5820.708964551755, 5823.883522329572, 5837.9124313135335, 24558.877205614037, 25016.24951251447, 25163.496730065297, 25240.495190096095, 25308.114216002352, 2401.78383945444, 2477.7646123618406, 2487.1543675150356, 2696.312440327704, 2808.5225511663066, 10088.798224035552, 14826.184559849204, 15053.623659408493, 15115.16866572338, 15329.846701533064, 1904.6762050451318, 1974.8518861085333, 1981.0787983587702, 1991.980080199194, 2042.948926276855, 81517.59241203815, 81981.18018819795, 83332.58333708353, 83899.58050209771, 83914.58042709809, 11025.503852326665, 11135.610253641245, 11276.534050573373, 11402.429878506042, 11586.304821710724, 15485.070895746067, 15685.0, 15709.371625135094, 15726.29231684577, 15734.606634833992, 8296.460730052528, 8435.620397082146, 8484.660613575388, 8565.743027709179, 8583.699570515002, 8172.6730930762105, 8258.710945116893, 8307.543085130255, 8396.454230475, 8403.159684031549, 4711.387519622427, 4812.735299558558, 4824.951750482521, 4828.734419606955, 4939.87650308738, 1916.4293160811565, 1955.904693371688, 1998.9500262493555, 2001.4996250937265, 2014.7179394884436, 955.2071780422372, 957.9856302155473, 971.2424309038961, 1029.0995379043336, 1038.133158812385, 18987.43037708871, 20192.0, 20759.377218683465, 21258.468538286357, 21647.89176054141, 983.149575617086, 1000.6097621927454, 1010.6816352848829, 1012.6556970630021, 1058.5342449322275, 10580.518727378174, 11291.266067705574, 11340.20618556693, 11374.715632109099, 11376.829347559793, 470227.0, 476990.0, 477130.0, 494829.0, 511369.0, 77751.0, 96591.51704241434, 99841.50079249557, 100434.4978275104, 104086.4795676032, 1035.7203555040096, 1040.079529616295, 1050.2490719135856, 1061.4533515239502, 1071.2073065931154, 14637.26813659334, 17441.73837392415, 18013.819861801214, 18627.627447450704, 19165.712514312574, 41780.58219417888, 43622.781886090364, 44258.3361249588, 44452.55547444484, 44929.32606010847, 57721.0, 57896.42103579079, 58409.70795145997, 59803.70098149481, 60232.09651855313, 7294.927050729425, 7624.809379765328, 7646.847063058596, 8401.07588165289, 8728.956355218183, 9597.376170548892, 11960.46177922013, 13212.603621891358, 13233.470661173445, 13300.334983250992, 11792.587259445878, 11840.822387664364, 11862.347570883685, 11977.700557486132, 12226.266424014231, 10961.123110151328, 11460.828087578526, 11559.0, 11630.0, 11641.41792910368, 11766.764664706829, 11820.231684940796, 11885.940570297093, 12208.511659533518, 12253.632391028283, 7587.165411804807, 8342.249197572248, 8581.485110893367, 8745.47527148373, 8798.516081615573, 11389.373584452935, 11464.94267528657, 11535.077193824642, 11795.174337796272, 11944.820827687417], "value": 9604.669217360126, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1495.8728508076817, 1510.410939733504, 1642.6468309313495, 1749.2390809997644, 1772.7695399598051, 8571.271441927436, 9148.542572871347, 9179.586918588662, 9196.0803919608, 9198.080191980807, 7836.255555722198, 8514.403991720583, 8733.170348816868, 8781.7804554886, 9016.68441604544, 2338.403707054703, 2348.4363752699314, 2360.126753101355, 2363.7163540375177, 2368.455255291284, 2324.6164382876805, 2335.976640233593, 2383.8212134089927, 2385.689860318165, 2386.8209884258663, 2063.298478517304, 2125.2136709417537, 2129.861558998668, 2136.1562182937732, 2258.435391152212, 2339.6841426407473, 2374.2877136858874, 2375.085592047057, 2385.7614238576175, 2388.1044608271723, 2314.7338056123594, 2321.651752237161, 2341.1454818991115, 2350.8707021113833, 2352.8235382346393, 9134.269258459308, 9150.222231110363, 9178.311626627963, 9190.0, 9192.770180745469, 5195.402528709171, 5343.0, 5399.514043736082, 5411.2965314508865, 5416.350037995466, 3334.433146365124, 3391.1522119470133, 3482.077249528877, 3496.3531746626954, 3499.790012599227, 1163.3252713426193, 1188.3701638131804, 1205.1985429689246, 1221.5663439478947, 1226.5277868020787, 12615.558455454107, 12632.873671263262, 12645.873541264562, 12653.683657908627, 12656.6835829105, 4522.140793249272, 4672.159011377917, 4685.81256749733, 4791.161546729378, 4795.472498025214, 10657.0, 10684.25210235276, 10690.358578485315, 10697.786044279072, 10698.51856666452, 5345.705986170798, 5359.544438722674, 5361.222622719683, 5363.651362661414, 5366.0877650798675, 4757.833475828329, 4877.6829506081995, 4927.802887884516, 4950.455449900508, 4955.950440495621, 3844.9231015379537, 3891.124496988155, 3965.0, 3985.501812273466, 3997.7401468904427, 1169.5088063013554, 1172.3903570143477, 1181.4506254591483, 1192.0404074719934, 1198.7302856857136, 853.1042405474227, 853.6884037326331, 998.1964518562627, 1028.1928685981468, 1037.0666400239845, 6195.783147589813, 6349.809505714744, 6407.679616019273, 6437.710303036374, 6494.870102597922, 505.3834322126999, 514.4752352600327, 517.7488917874828, 522.2218893848138, 665.2781731820932, 4250.574942505725, 4499.910001799945, 4517.954820451753, 4577.8168873244695, 4587.518310577341, 10672.092872105957, 11167.106631469464, 11198.664040078811, 11203.495842687098, 11213.159013074051, 9905.653302134391, 10402.635907743344, 10914.617988370368, 11131.610393636345, 11132.387718675389, 8377.539235342114, 8455.196756308142, 8487.533185674847, 8522.57387130641, 8537.871931921027, 6143.447089761943, 6340.809775706736, 6364.109024736448, 6443.67781610927, 6545.5090868184125, 9966.152877005246, 10161.441120738431, 10203.642872499428, 10347.84478232812, 10352.482375881327, 10460.790784184426, 10464.424456654653, 10485.842712359474, 10519.737006574896, 10604.416757078126, 7554.924450755422, 7629.618519074135, 7632.236776322324, 7634.198409166957, 7636.618169091635, 8490.15098490146, 8511.95744021276, 8569.271611913056, 8593.710943358547, 8608.053114157563, 7828.960855195687, 7867.8819817703925, 7883.7240696575345, 7909.05091389037, 7943.324817390587, 7506.061742282215, 7510.887336690063, 7717.961410192913, 7733.729319473791, 7777.766666999999, 7299.598522081124, 7362.6318684066655, 7362.815929601588, 7370.152432470334, 7392.778216653509, 5282.418933917343, 5370.516653501204, 5475.698836564027, 5547.1679248111495, 5580.162975553537, 5431.83704488866, 5589.692566908859, 5590.8043218487155, 5655.208270842003, 5786.0], "value": 4664.699386755713, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [323.82837096338943, 324.6882594318952, 332.6507167474152, 333.8581103031211, 334.24794213020704, 5383.81156659517, 5391.32608423947, 5396.3524377074755, 5398.352197736277, 5451.509364157225, 5305.761240744167, 5325.520703136717, 5363.846772943816, 5372.382176049756, 5378.273933019051, 3980.4626375439234, 4073.2464494068545, 4144.606262405066, 4175.832966681329, 4194.224068547313, 4103.871435355286, 4131.917361652765, 4136.296829538971, 4157.293260145782, 4167.687423443239, 3976.16500534888, 4137.8965525861795, 4151.190517849021, 4161.771102589357, 4172.04043070094, 4064.634182923536, 4127.587241275848, 4131.338985762263, 4140.399642051901, 4150.294449943517, 3662.267546490686, 3664.8534058637624, 3669.94495082574, 3676.7793932364143, 3686.7603605765808, 5228.503292187236, 5228.869278268074, 5254.21186821976, 5257.63301541602, 5264.842054738326, 4572.839950601713, 4752.572268495817, 4759.643501602027, 4808.879778005543, 4817.710937343771, 5564.916526252109, 5584.687598414369, 5590.301212348457, 5594.356648985378, 5628.943710562883, 3840.8463661453507, 4000.6799456043445, 4017.5580686124504, 4035.1122752994293, 4061.959380406188, 5807.593468457209, 5818.8254352369495, 5830.0, 5831.4168583141345, 5843.620164689281, 4132.73137246078, 4144.109016561454, 4149.190907773016, 4155.439015732837, 4156.542780294165, 4071.42999980003, 4177.352510360899, 4224.429701990253, 4226.302660061056, 4232.597903199191, 4747.216709243005, 4783.115123702057, 4793.13723529768, 4798.352222449995, 4804.42346918365, 5640.943590564124, 5666.0, 5670.376258611549, 5670.858228544319, 5695.515881150149, 1392.9024968252124, 1410.703752212047, 1411.708286917459, 1424.3803945283835, 1428.7642538980951, 897.2373482539789, 899.4603238057114, 941.5433514745343, 954.160338901762, 969.0987381734914, 5334.866628334245, 5343.5190832824455, 5372.543333816591, 5416.91874621881, 5457.263269458573, 5704.258446402024, 5741.626794258444, 5745.626534275342, 5765.385692006245, 5780.1907732917425, 5231.503007214308, 5449.0, 5495.807646732425, 5564.136014435128, 5588.552915766729, 3084.259777653347, 3090.629124505029, 3099.9380012399624, 3107.1610665120293, 3127.03062050765, 5850.444207800252, 5999.850003749942, 6010.218671572755, 6038.909416358758, 6049.669072803976, 5901.645901245939, 5916.585838991229, 5917.467427931507, 5930.043085781682, 5936.1986131871645, 5994.340622531518, 6005.6396616203165, 6007.969960150172, 6008.999999999913, 6049.8487537811025, 5621.297337832771, 5721.685307308138, 5734.311882574118, 5747.453991870766, 5768.94231057684, 5685.971570142123, 5702.6863522506665, 5715.885682286248, 5749.9712501437225, 5753.4246575343805, 5686.658800471985, 5939.4951429129005, 5940.762369505172, 5970.716295996208, 5985.772916552183, 4092.2633925892433, 4104.610062044101, 4113.444684967491, 4127.566605506378, 4130.483689538808, 5846.047745888299, 5898.35118136996, 5915.438033386821, 5915.91126133117, 5920.407959204045, 5623.297087864017, 5632.521235694848, 5635.633683810539, 5669.603127781016, 5779.0, 5589.776408943597, 5627.0, 5632.746526406403, 5639.238702775073, 5662.377138514677, 5427.6200665953, 5525.557955363642, 5597.888042239214, 5640.774369025357, 5715.114157305624, 5618.185363122243, 5640.097584386478, 5668.489835914787, 5678.488935995781, 5717.342505611908, 5477.1510415885605, 5579.637323573955, 5623.2408624835125, 5625.481120097633, 5640.661560306395], "value": 4293.401889666791, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [712.5653351455612, 722.2632914427281, 744.3040756892302, 776.3439893290168, 799.0451410564374, 15928.68142637148, 17025.06362150084, 17060.573485662866, 17115.0, 17267.0, 11597.65207043788, 15262.542123736277, 15340.0, 15415.0, 15422.460213892517, 793.9325157361617, 822.3051521464353, 822.461287856455, 825.2572684583863, 825.413956091176, 819.7704642700054, 831.9168083191693, 832.7168762620707, 832.9167083291683, 833.1335411172373, 715.4097869257857, 852.228732996639, 867.3364875869964, 870.4559650218613, 871.0375035585681, 842.4566154830162, 843.28320927212, 843.4011851585382, 844.1684940333766, 860.2515811244226, 612.8375980365207, 614.4715544631613, 615.5444970721634, 617.299365220478, 620.1503939602773, 15435.536933892, 15456.845431545766, 15468.226588670634, 15475.535733928, 15476.922615386851, 14833.55499335011, 14860.182689952047, 14875.702485950329, 14928.70142597142, 15092.245387730569, 13717.245551494663, 13752.0, 13755.518556850562, 13835.79246311306, 14178.0, 3578.785272883635, 3688.6680198782237, 3756.849726010956, 3850.114473671071, 4485.529019452975, 87366.0, 88203.99999999936, 88545.0, 88727.11272887318, 90494.0, 11514.136439766884, 11584.826227606593, 11596.94201528987, 11684.474198660911, 11743.17797754149, 22138.557228855334, 22154.44613884666, 22155.224567140394, 22164.445888852584, 22180.112795488323, 8288.668453261922, 8429.915700843036, 8476.660933562713, 8822.911770882209, 8898.911010889939, 4348.260795664744, 4362.520122786491, 4381.364702118175, 4523.819047238139, 4606.539346065434, 3427.4002049641213, 3533.5759708835103, 3543.291341731664, 3548.7515873889097, 3554.0581745837376, 623.2769986815273, 641.1568787045021, 668.301624802083, 692.1071817355555, 695.391532409142, 681.802277339566, 694.7880896326669, 737.5206116024519, 738.0110651726712, 748.7753673897809, 10036.799264014679, 10115.494225288707, 10238.897611023795, 10354.17166626668, 10471.109955653856, 660.5145218264572, 672.5964421347153, 695.3113731653626, 697.4106879686657, 709.6097146569366, 4551.294549344857, 4656.4877863434995, 4703.905921881543, 4825.95174048262, 4880.438749543777, 134875.0, 135095.0, 135260.0, 135285.0, 135334.0, 68301.0, 106735.4663226679, 111431.0, 112115.43942280236, 114310.42844785722, 100659.0, 103264.48367758113, 104320.47839760753, 105585.0, 106950.46524767326, 9174.449533028039, 9482.525873706425, 9492.620295188115, 9551.665691700757, 9569.952150239204, 58274.4172558269, 58753.70623146857, 59427.40572594219, 59548.70225648844, 59582.40417595769, 59818.0, 83807.0, 85348.57325713332, 86962.56518717366, 87263.56368218118, 11525.654230373102, 11712.941435292769, 11861.76276474483, 12012.879871201525, 12170.939145304217, 13382.531611393555, 13452.865471345553, 14594.0, 14670.853291466949, 15222.010569312959, 14615.170327920689, 14877.47928822486, 14967.0, 15237.238138093273, 15311.923440382727, 13305.334733263491, 13385.397657105648, 13625.28001903157, 13982.230977296347, 14353.64115897111, 13542.0, 13880.305984700926, 13979.440822367398, 14464.0, 14549.376797698962, 10653.360798352123, 10789.406582637715, 10999.725006874573, 11670.299782013106, 11790.292582445081, 11767.52929882795, 12321.322327272086, 12477.313747743598, 12729.0, 13192.73614527685], "value": 7828.74670375679, "unit": "score"}], "name": "dromaeo_css", "value": 7383.8390315919805, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 111.0, 110.0, 111.0, 110.0, 111.0, 109.0, 110.0, 110.0, 110.0], "value": 109.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 116.0, 123.0, 170.0, 124.0, 119.0, 146.0, 116.0, 147.0, 116.0], "value": 132.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 159.0, 161.0, 161.0, 161.0, 161.0, 159.0, 159.0, 161.0, 161.0], "value": 160.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 76.0, 113.0, 75.0, 75.0, 74.0, 75.0, 109.0, 74.0], "value": 82.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 109.0, 84.0, 83.0, 84.0, 111.0, 83.0, 83.0, 128.0], "value": 93.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 116.0, 116.0, 117.0, 117.0, 119.0, 117.0, 117.0, 117.0, 117.0], "value": 116.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 148.0, 146.0, 145.0, 146.0, 147.0, 146.0, 147.0, 146.0, 146.0], "value": 146.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 94.0, 95.0, 95.0, 95.0, 95.0, 95.0, 94.0, 95.0], "value": 94.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [51.0, 49.0, 49.0, 51.0, 50.0, 49.0, 51.0, 50.0, 49.0, 49.0], "value": 49.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 62.0, 62.0, 61.0, 63.0, 62.0, 62.0, 62.0, 62.0, 62.0], "value": 61.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 78.0, 75.0, 76.0, 75.0, 83.0, 74.0, 74.0, 75.0], "value": 76.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [123.0, 116.0, 132.0, 120.0, 129.0, 118.0, 126.0, 119.0, 163.0, 121.0], "value": 126.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 156.0, 156.0, 153.0, 154.0, 157.0, 154.0, 156.0, 157.0, 160.0], "value": 156.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 63.0, 68.0, 62.0, 71.0, 66.0, 63.0, 64.0, 61.0, 63.0], "value": 64.3, "unit": "score"}], "name": "kraken", "value": 1470.3999999999999, "alertThreshold": 2.0}]} 04:42:28 INFO - Return code: 0 04:42:28 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:42:28 INFO - # TBPL SUCCESS # 04:42:28 INFO - Running post-action listener: _resource_record_post_action 04:42:28 INFO - ##### 04:42:28 INFO - ##### Finished run-tests step (success) 04:42:28 INFO - ##### 04:42:28 INFO - Running post-run listener: _resource_record_post_run 04:42:28 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 4096; Write bytes: 565870592; Read time: 8; Write time: 407832 04:42:28 INFO - TinderboxPrint: CPU usage
12.9% 04:42:28 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 04:42:28 INFO - TinderboxPrint: I/O write bytes / time
565,870,592 / 407,832 04:42:28 INFO - TinderboxPrint: CPU idle
8,275.5 (87.1%) 04:42:28 INFO - TinderboxPrint: CPU user
1,187.6 (12.5%) 04:42:28 INFO - TinderboxPrint: Swap in / out
0 / 0 04:42:28 INFO - install - Wall time: 18s; CPU: 14.0%; Read bytes: 0; Write bytes: 257372160; Read time: 0; Write time: 249140 04:42:28 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 0; Write bytes: 296566784; Read time: 0; Write time: 156708 04:42:29 INFO - Running post-run listener: _upload_blobber_files 04:42:29 INFO - Blob upload gear active. 04:42:29 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:42:29 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 04:42:29 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'] 04:42:29 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 04:42:29 INFO - (blobuploader) - INFO - Open directory for files ... 04:42:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:42:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:42:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:42:33 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:42:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:42:33 INFO - (blobuploader) - INFO - Done attempting. 04:42:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 04:42:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:42:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:42:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 04:42:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:42:34 INFO - (blobuploader) - INFO - Done attempting. 04:42:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 04:42:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:42:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:42:35 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 04:42:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:42:35 INFO - (blobuploader) - INFO - Done attempting. 04:42:35 INFO - (blobuploader) - INFO - Iteration through files over. 04:42:35 INFO - Return code: 0 04:42:35 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:42:35 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:42:35 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/cb1bf31673a61317abc7cacf0c4be2f9a824f21c43c5ce4e930667d6c57e869f145a121412fb2e41f37fca1a6c5de5a890adfea41a2bea37d54169c743a611af", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/954577527ba3b1033ae4b9817a033b09c939e6a27e8f002ff00252f42ec3203a5948b07056944ebd47309447de94fdd9d3aa100035852036a0d6eaf431a0e044", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/122e156cdd2056081a468d3a9b01d2907e51acc750bff5c03d244ca1972eb7c01b4743776f67117c0a167578219cdf4b899dcef675dd7a71666a41778555cac8"} 04:42:35 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:42:35 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:42:35 INFO - Contents: 04:42:35 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/cb1bf31673a61317abc7cacf0c4be2f9a824f21c43c5ce4e930667d6c57e869f145a121412fb2e41f37fca1a6c5de5a890adfea41a2bea37d54169c743a611af", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/954577527ba3b1033ae4b9817a033b09c939e6a27e8f002ff00252f42ec3203a5948b07056944ebd47309447de94fdd9d3aa100035852036a0d6eaf431a0e044", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/122e156cdd2056081a468d3a9b01d2907e51acc750bff5c03d244ca1972eb7c01b4743776f67117c0a167578219cdf4b899dcef675dd7a71666a41778555cac8"} 04:42:35 INFO - Running post-run listener: copy_logs_to_upload_dir 04:42:35 INFO - Copying logs to upload dir... 04:42:35 INFO - mkdir: /builds/slave/test/build/upload/logs 04:42:35 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.690426 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-07-16 04:42:34.688929) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-16 04:42:34.692726) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/cb1bf31673a61317abc7cacf0c4be2f9a824f21c43c5ce4e930667d6c57e869f145a121412fb2e41f37fca1a6c5de5a890adfea41a2bea37d54169c743a611af", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/954577527ba3b1033ae4b9817a033b09c939e6a27e8f002ff00252f42ec3203a5948b07056944ebd47309447de94fdd9d3aa100035852036a0d6eaf431a0e044", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/122e156cdd2056081a468d3a9b01d2907e51acc750bff5c03d244ca1972eb7c01b4743776f67117c0a167578219cdf4b899dcef675dd7a71666a41778555cac8"} build_url:https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011233 build_url: 'https://queue.taskcluster.net/v1/task/ecgEOmDMQiujRrYtfEwZ7g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/cb1bf31673a61317abc7cacf0c4be2f9a824f21c43c5ce4e930667d6c57e869f145a121412fb2e41f37fca1a6c5de5a890adfea41a2bea37d54169c743a611af", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/954577527ba3b1033ae4b9817a033b09c939e6a27e8f002ff00252f42ec3203a5948b07056944ebd47309447de94fdd9d3aa100035852036a0d6eaf431a0e044", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/122e156cdd2056081a468d3a9b01d2907e51acc750bff5c03d244ca1972eb7c01b4743776f67117c0a167578219cdf4b899dcef675dd7a71666a41778555cac8"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-16 04:42:34.718800) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-16 04:42:34.719212) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1468666673.703281-837208322 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004496 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-16 04:42:34.800703) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-16 04:42:34.801074) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-16 04:42:34.801428) ========= ========= Total master_lag: 0.16 =========