builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-048 starttime: 1467214121.73 results: success (0) buildid: 20160629071428 builduid: 3ce221c54d684cfe9ee4af296fec3836 revision: b69a5bbb5e40bd426e35222baa600b481e50d265 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:41.732725) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:41.733190) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:41.733479) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:41.748041) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:41.748309) ========= 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=fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-29 08:28:42-- 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% 96.0M=0s 2016-06-29 08:28:43 (96.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.098629 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:41.861295) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:41.861680) ========= 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=fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019465 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:41.911319) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-06-29 08:28:41.911699) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev b69a5bbb5e40bd426e35222baa600b481e50d265 --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 b69a5bbb5e40bd426e35222baa600b481e50d265 --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=fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-29 08:28:43,192 truncating revision to first 12 chars 2016-06-29 08:28:43,193 Setting DEBUG logging. 2016-06-29 08:28:43,193 attempt 1/10 2016-06-29 08:28:43,193 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/b69a5bbb5e40?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-29 08:28:44,202 unpacking tar archive at: mozilla-central-b69a5bbb5e40/testing/mozharness/ program finished with exit code 0 elapsedTime=1.352365 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-06-29 08:28:43.278782) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:43.279111) ========= script_repo_revision: b69a5bbb5e40bd426e35222baa600b481e50d265 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:43.279531) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:43.279808) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-29 08:28:43.289981) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-06-29 08:28:43.290373) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 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-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] 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=fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:28:44 INFO - MultiFileLogger online at 20160629 08:28:44 in /builds/slave/test 08:28:44 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 08:28:44 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:28:44 INFO - {'append_to_log': False, 08:28:44 INFO - 'base_work_dir': '/builds/slave/test', 08:28:44 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 08:28:44 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:28:44 INFO - 'branch': 'Firefox-Non-PGO', 08:28:44 INFO - 'buildbot_json_path': 'buildprops.json', 08:28:44 INFO - 'config_files': ('talos/linux_config.py',), 08:28:44 INFO - 'default_actions': ('clobber', 08:28:44 INFO - 'read-buildbot-config', 08:28:44 INFO - 'download-and-extract', 08:28:44 INFO - 'populate-webroot', 08:28:44 INFO - 'create-virtualenv', 08:28:44 INFO - 'install', 08:28:44 INFO - 'run-tests'), 08:28:44 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:28:44 INFO - 'download_minidump_stackwalk': True, 08:28:44 INFO - 'download_symbols': 'ondemand', 08:28:44 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:28:44 INFO - 'tooltool.py': '/tools/tooltool.py', 08:28:44 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:28:44 INFO - '/tools/misc-python/virtualenv.py')}, 08:28:44 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:28:44 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:28:44 INFO - 'installer_path': 'installer.exe', 08:28:44 INFO - 'log_level': 'info', 08:28:44 INFO - 'log_name': 'talos', 08:28:44 INFO - 'log_to_console': True, 08:28:44 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:28:44 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:28:44 INFO - 'opt_config_files': (), 08:28:44 INFO - 'pip_index': False, 08:28:44 INFO - 'sps_profile': False, 08:28:44 INFO - 'sps_profile_interval': 0, 08:28:44 INFO - 'suite': 'dromaeojs', 08:28:44 INFO - 'system_bits': '32', 08:28:44 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:28:44 INFO - 'title': 'talos-linux64-ix-048', 08:28:44 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:28:44 INFO - 'use_talos_json': True, 08:28:44 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:28:44 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:28:44 INFO - 'work_dir': 'build'} 08:28:44 INFO - ##### 08:28:44 INFO - ##### Running clobber step. 08:28:44 INFO - ##### 08:28:44 INFO - Running pre-action listener: _resource_record_pre_action 08:28:44 INFO - Running main action method: clobber 08:28:44 INFO - rmtree: /builds/slave/test/build 08:28:44 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:28:45 INFO - Running post-action listener: _resource_record_post_action 08:28:45 INFO - ##### 08:28:45 INFO - ##### Finished clobber step (success) 08:28:45 INFO - ##### 08:28:45 INFO - ##### 08:28:45 INFO - ##### Running read-buildbot-config step. 08:28:45 INFO - ##### 08:28:45 INFO - Running pre-action listener: _resource_record_pre_action 08:28:45 INFO - Running main action method: read_buildbot_config 08:28:45 INFO - Using buildbot properties: 08:28:45 INFO - { 08:28:45 INFO - "project": "", 08:28:45 INFO - "product": "firefox", 08:28:45 INFO - "script_repo_revision": "production", 08:28:45 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 08:28:45 INFO - "repository": "", 08:28:45 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 08:28:45 INFO - "buildid": "20160629071428", 08:28:45 INFO - "pgo_build": "False", 08:28:45 INFO - "basedir": "/builds/slave/test", 08:28:45 INFO - "buildnumber": 133, 08:28:45 INFO - "slavename": "talos-linux64-ix-048", 08:28:45 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 08:28:45 INFO - "platform": "ubuntu64_hw", 08:28:45 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 08:28:45 INFO - "branch": "mozilla-central", 08:28:45 INFO - "repo_path": "mozilla-central", 08:28:45 INFO - "revision": "b69a5bbb5e40bd426e35222baa600b481e50d265", 08:28:45 INFO - "stage_platform": "linux64", 08:28:45 INFO - "builduid": "3ce221c54d684cfe9ee4af296fec3836", 08:28:45 INFO - "slavebuilddir": "test" 08:28:45 INFO - } 08:28:45 INFO - Found installer url https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 08:28:45 INFO - Running post-action listener: _resource_record_post_action 08:28:45 INFO - ##### 08:28:45 INFO - ##### Finished read-buildbot-config step (success) 08:28:45 INFO - ##### 08:28:45 INFO - ##### 08:28:45 INFO - ##### Running download-and-extract step. 08:28:45 INFO - ##### 08:28:45 INFO - Running pre-action listener: _resource_record_pre_action 08:28:45 INFO - Running main action method: download_and_extract 08:28:45 INFO - mkdir: /builds/slave/test/build/tests 08:28:45 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')]} 08:28:45 INFO - https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 08:28:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:28:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:28:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:46 INFO - Downloaded 1361 bytes. 08:28:46 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:28:46 INFO - Using the following test package requirements: 08:28:46 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 08:28:46 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:28:46 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:28:46 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:28:46 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 08:28:46 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:28:46 INFO - u'jsshell-linux-x86_64.zip'], 08:28:46 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:28:46 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:28:46 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 08:28:46 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:28:46 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:28:46 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:28:46 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:28:46 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:28:46 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:28:46 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:28:46 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:28:46 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:28:46 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')]} 08:28:46 INFO - https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:28:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:28:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:28:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:47 INFO - Downloaded 22701701 bytes. 08:28:47 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'] 08:28:47 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 08:28:48 INFO - Return code: 0 08:28:48 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 08:28:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:28:48 INFO - https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:28:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:28:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:28:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:50 INFO - Downloaded 22701701 bytes. 08:28:50 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'] 08:28:50 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 08:28:51 INFO - Return code: 0 08:28:51 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')]} 08:28:51 INFO - https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:28:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 08:28:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 08:28:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:53 INFO - Downloaded 14405245 bytes. 08:28:53 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'] 08:28:53 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 08:28:53 INFO - Return code: 0 08:28:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:28:53 INFO - https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:28:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:28:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:28:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f0O4T6PHQdeaTgOOfixZwg/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 08:28:54 INFO - Downloaded 56478543 bytes. 08:28:54 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:28:54 INFO - mkdir: /builds/slave/test/properties 08:28:54 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:28:54 INFO - Writing to file /builds/slave/test/properties/build_url 08:28:54 INFO - Contents: 08:28:54 INFO - build_url:https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:28:55 INFO - Running post-action listener: _resource_record_post_action 08:28:55 INFO - Running post-action listener: set_extra_try_arguments 08:28:55 INFO - ##### 08:28:55 INFO - ##### Finished download-and-extract step (success) 08:28:55 INFO - ##### 08:28:55 INFO - ##### 08:28:55 INFO - ##### Running populate-webroot step. 08:28:55 INFO - ##### 08:28:55 INFO - Running pre-action listener: _resource_record_pre_action 08:28:55 INFO - Running main action method: populate_webroot 08:28:55 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:28:55 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:28:55 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:28:55 INFO - '--tppagecycles', 08:28:55 INFO - '7'], 08:28:55 INFO - 'tests': ['tsvgm']}}, 08:28:55 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:28:55 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:28:55 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:28:55 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:28:55 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:55 INFO - 'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:28:55 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:55 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:28:55 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:55 INFO - 'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['damp', 'tps']}, 08:28:55 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:55 INFO - 'tests': ['damp', 'tps']}, 08:28:55 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['dromaeo_dom']}, 08:28:55 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:28:55 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['basic_compositor_video']}, 08:28:55 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:28:55 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['a11yr', 08:28:55 INFO - 'ts_paint', 08:28:55 INFO - 'tpaint', 08:28:55 INFO - 'sessionrestore', 08:28:55 INFO - 'sessionrestore_no_auto_restore', 08:28:55 INFO - 'tabpaint']}, 08:28:55 INFO - 'other-e10s': {'tests': ['a11yr', 08:28:55 INFO - 'ts_paint', 08:28:55 INFO - 'tpaint', 08:28:55 INFO - 'sessionrestore', 08:28:55 INFO - 'sessionrestore_no_auto_restore', 08:28:55 INFO - 'tabpaint']}, 08:28:55 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:28:55 INFO - 'ts_paint', 08:28:55 INFO - 'tpaint', 08:28:55 INFO - 'sessionrestore', 08:28:55 INFO - 'sessionrestore_no_auto_restore', 08:28:55 INFO - 'tabpaint']}, 08:28:55 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:28:55 INFO - 'ts_paint', 08:28:55 INFO - 'tpaint', 08:28:55 INFO - 'sessionrestore', 08:28:55 INFO - 'sessionrestore_no_auto_restore', 08:28:55 INFO - 'tabpaint']}, 08:28:55 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['a11yr', 08:28:55 INFO - 'ts_paint', 08:28:55 INFO - 'tpaint', 08:28:55 INFO - 'sessionrestore', 08:28:55 INFO - 'sessionrestore_no_auto_restore', 08:28:55 INFO - 'tabpaint']}, 08:28:55 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['a11yr', 08:28:55 INFO - 'ts_paint', 08:28:55 INFO - 'tpaint', 08:28:55 INFO - 'sessionrestore', 08:28:55 INFO - 'sessionrestore_no_auto_restore', 08:28:55 INFO - 'tabpaint']}, 08:28:55 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['tsvgx', 08:28:55 INFO - 'tsvgr_opacity', 08:28:55 INFO - 'tart', 08:28:55 INFO - 'tscrollx', 08:28:55 INFO - 'cart']}, 08:28:55 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:28:55 INFO - 'tsvgr_opacity', 08:28:55 INFO - 'tart', 08:28:55 INFO - 'tscrollx', 08:28:55 INFO - 'cart']}, 08:28:55 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:55 INFO - 'talos_options': ['--disable-e10s'], 08:28:55 INFO - 'tests': ['tp5o']}, 08:28:55 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:55 INFO - 'tests': ['tp5o']}, 08:28:55 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:55 INFO - 'talos_options': ['--disable-e10s', 08:28:55 INFO - '--xperf_path', 08:28:55 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:28:55 INFO - 'tests': ['tp5n']}, 08:28:55 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:28:55 INFO - 'talos_options': ['--xperf_path', 08:28:55 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:28:55 INFO - 'tests': ['tp5n']}}, 08:28:55 INFO - 'talos.zip': {'path': '', 08:28:55 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:28:55 INFO - Running post-action listener: _resource_record_post_action 08:28:55 INFO - ##### 08:28:55 INFO - ##### Finished populate-webroot step (success) 08:28:55 INFO - ##### 08:28:55 INFO - ##### 08:28:55 INFO - ##### Running create-virtualenv step. 08:28:55 INFO - ##### 08:28:55 INFO - Running pre-action listener: _resource_record_pre_action 08:28:55 INFO - Running main action method: create_virtualenv 08:28:55 INFO - Creating virtualenv /builds/slave/test/build/venv 08:28:55 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 08:28:55 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:28:55 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:28:55 INFO - Using real prefix '/usr' 08:28:55 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:28:56 INFO - Installing distribute.............................................................................................................................................................................................done. 08:28:58 INFO - Installing pip.................done. 08:28:58 INFO - Return code: 0 08:28:58 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:28:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:28:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:28:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:28:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:28:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:28:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:28:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:28:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 08:28:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 08:28:58 INFO - Using env: {'DISPLAY': ':0', 08:28:58 INFO - 'HOME': '/home/cltbld', 08:28:58 INFO - 'LANG': 'en_US.UTF-8', 08:28:58 INFO - 'LANGUAGE': 'en_US:en', 08:28:58 INFO - 'LOGNAME': 'cltbld', 08:28:58 INFO - 'MAIL': '/var/mail/cltbld', 08:28:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:28:58 INFO - 'MOZ_NO_REMOTE': '1', 08:28:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:28:58 INFO - 'NO_EM_RESTART': '1', 08:28:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:28:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:28:58 INFO - 'PWD': '/builds/slave/test', 08:28:58 INFO - 'SHELL': '/bin/bash', 08:28:58 INFO - 'SHLVL': '1', 08:28:58 INFO - 'TERM': 'linux', 08:28:58 INFO - 'TMOUT': '86400', 08:28:58 INFO - 'USER': 'cltbld', 08:28:58 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:28:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:28:58 INFO - '_': '/tools/buildbot/bin/python'} 08:28:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:28:58 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 08:28:58 INFO - Cleaning up... 08:28:58 INFO - Return code: 0 08:28:58 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:28:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:28:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:28:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:28:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:28:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:28:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:28:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:28:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 08:28:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 08:28:58 INFO - Using env: {'DISPLAY': ':0', 08:28:58 INFO - 'HOME': '/home/cltbld', 08:28:58 INFO - 'LANG': 'en_US.UTF-8', 08:28:58 INFO - 'LANGUAGE': 'en_US:en', 08:28:58 INFO - 'LOGNAME': 'cltbld', 08:28:58 INFO - 'MAIL': '/var/mail/cltbld', 08:28:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:28:58 INFO - 'MOZ_NO_REMOTE': '1', 08:28:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:28:58 INFO - 'NO_EM_RESTART': '1', 08:28:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:28:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:28:58 INFO - 'PWD': '/builds/slave/test', 08:28:58 INFO - 'SHELL': '/bin/bash', 08:28:58 INFO - 'SHLVL': '1', 08:28:58 INFO - 'TERM': 'linux', 08:28:58 INFO - 'TMOUT': '86400', 08:28:58 INFO - 'USER': 'cltbld', 08:28:58 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:28:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:28:58 INFO - '_': '/tools/buildbot/bin/python'} 08:28:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:28:58 INFO - Downloading/unpacking psutil>=3.1.1 08:28:58 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 08:28:58 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 08:28:58 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 08:28:58 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 08:28:58 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 08:28:58 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 08:29:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:29:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:29:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:29:00 INFO - Installing collected packages: psutil 08:29:00 INFO - Running setup.py install for psutil 08:29:00 INFO - building 'psutil._psutil_linux' extension 08:29:00 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 08:29:00 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 08:29:00 INFO - building 'psutil._psutil_posix' extension 08:29:00 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 08:29:00 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 08:29:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:29:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:29:00 INFO - Successfully installed psutil 08:29:00 INFO - Cleaning up... 08:29:01 INFO - Return code: 0 08:29:01 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:29:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:29:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:29:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:01 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 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:29:01 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 08:29:01 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 08:29:01 INFO - Using env: {'DISPLAY': ':0', 08:29:01 INFO - 'HOME': '/home/cltbld', 08:29:01 INFO - 'LANG': 'en_US.UTF-8', 08:29:01 INFO - 'LANGUAGE': 'en_US:en', 08:29:01 INFO - 'LOGNAME': 'cltbld', 08:29:01 INFO - 'MAIL': '/var/mail/cltbld', 08:29:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:01 INFO - 'MOZ_NO_REMOTE': '1', 08:29:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:29:01 INFO - 'NO_EM_RESTART': '1', 08:29:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:29:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:01 INFO - 'PWD': '/builds/slave/test', 08:29:01 INFO - 'SHELL': '/bin/bash', 08:29:01 INFO - 'SHLVL': '1', 08:29:01 INFO - 'TERM': 'linux', 08:29:01 INFO - 'TMOUT': '86400', 08:29:01 INFO - 'USER': 'cltbld', 08:29:01 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:29:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:01 INFO - '_': '/tools/buildbot/bin/python'} 08:29:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:01 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:29:01 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 08:29:01 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 08:29:01 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 08:29:01 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 08:29:01 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 08:29:01 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 08:29:03 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:29:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:29:03 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:29:03 INFO - Installing collected packages: mozsystemmonitor 08:29:03 INFO - Running setup.py install for mozsystemmonitor 08:29:03 INFO - Successfully installed mozsystemmonitor 08:29:03 INFO - Cleaning up... 08:29:03 INFO - Return code: 0 08:29:03 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:29: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')]} 08:29:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29: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')]} 08:29:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:03 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 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:29:03 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 08:29:03 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 08:29:03 INFO - Using env: {'DISPLAY': ':0', 08:29:03 INFO - 'HOME': '/home/cltbld', 08:29:03 INFO - 'LANG': 'en_US.UTF-8', 08:29:03 INFO - 'LANGUAGE': 'en_US:en', 08:29:03 INFO - 'LOGNAME': 'cltbld', 08:29:03 INFO - 'MAIL': '/var/mail/cltbld', 08:29:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:03 INFO - 'MOZ_NO_REMOTE': '1', 08:29:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:29:03 INFO - 'NO_EM_RESTART': '1', 08:29:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:29:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:03 INFO - 'PWD': '/builds/slave/test', 08:29:03 INFO - 'SHELL': '/bin/bash', 08:29:03 INFO - 'SHLVL': '1', 08:29:03 INFO - 'TERM': 'linux', 08:29:03 INFO - 'TMOUT': '86400', 08:29:03 INFO - 'USER': 'cltbld', 08:29:03 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:29:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:03 INFO - '_': '/tools/buildbot/bin/python'} 08:29:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:03 INFO - Downloading/unpacking jsonschema==2.5.1 08:29:03 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 08:29:03 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 08:29:03 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 08:29:03 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 08:29:03 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 08:29:03 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 08:29:05 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:29:05 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:29:05 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 08:29:05 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 08:29:05 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 08:29:05 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 08:29:05 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 08:29:05 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 08:29:05 INFO - Downloading functools32-3.2.3-2.tar.gz 08:29:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:29:05 INFO - warning: no files found matching '*.txt' 08:29:05 INFO - no previously-included directories found matching 'build' 08:29:05 INFO - no previously-included directories found matching 'dist' 08:29:05 INFO - no previously-included directories found matching '.git*' 08:29:05 INFO - Installing collected packages: jsonschema, functools32 08:29:05 INFO - Running setup.py install for functools32 08:29:05 INFO - warning: no files found matching '*.txt' 08:29:05 INFO - no previously-included directories found matching 'build' 08:29:05 INFO - no previously-included directories found matching 'dist' 08:29:05 INFO - no previously-included directories found matching '.git*' 08:29:05 INFO - Successfully installed jsonschema functools32 08:29:05 INFO - Cleaning up... 08:29:06 INFO - Return code: 0 08:29:06 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:29:06 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')]} 08:29:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:06 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')]} 08:29:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:06 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 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:29:06 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 08:29:06 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 08:29:06 INFO - Using env: {'DISPLAY': ':0', 08:29:06 INFO - 'HOME': '/home/cltbld', 08:29:06 INFO - 'LANG': 'en_US.UTF-8', 08:29:06 INFO - 'LANGUAGE': 'en_US:en', 08:29:06 INFO - 'LOGNAME': 'cltbld', 08:29:06 INFO - 'MAIL': '/var/mail/cltbld', 08:29:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:06 INFO - 'MOZ_NO_REMOTE': '1', 08:29:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:29:06 INFO - 'NO_EM_RESTART': '1', 08:29:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:29:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:06 INFO - 'PWD': '/builds/slave/test', 08:29:06 INFO - 'SHELL': '/bin/bash', 08:29:06 INFO - 'SHLVL': '1', 08:29:06 INFO - 'TERM': 'linux', 08:29:06 INFO - 'TMOUT': '86400', 08:29:06 INFO - 'USER': 'cltbld', 08:29:06 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:29:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:06 INFO - '_': '/tools/buildbot/bin/python'} 08:29:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:06 INFO - Downloading/unpacking blobuploader==1.2.4 08:29:06 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 08:29:06 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 08:29:06 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 08:29:06 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 08:29:06 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 08:29:06 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 08:29:08 INFO - Downloading blobuploader-1.2.4.tar.gz 08:29:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:29:08 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:29:08 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 08:29:08 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 08:29:08 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 08:29:08 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 08:29:08 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 08:29:08 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 08:29:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:29:08 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:29:08 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 08:29:08 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 08:29:08 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 08:29:08 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 08:29:08 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 08:29:08 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 08:29:08 INFO - Downloading docopt-0.6.1.tar.gz 08:29:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:29:08 INFO - Installing collected packages: blobuploader, requests, docopt 08:29:08 INFO - Running setup.py install for blobuploader 08:29:08 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:29:08 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:29:08 INFO - Running setup.py install for requests 08:29:09 INFO - Running setup.py install for docopt 08:29:09 INFO - Successfully installed blobuploader requests docopt 08:29:09 INFO - Cleaning up... 08:29:09 INFO - Return code: 0 08:29:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:29:09 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')]} 08:29:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:09 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')]} 08:29:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:09 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 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:29:09 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 08:29:09 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 08:29:09 INFO - Using env: {'DISPLAY': ':0', 08:29:09 INFO - 'HOME': '/home/cltbld', 08:29:09 INFO - 'LANG': 'en_US.UTF-8', 08:29:09 INFO - 'LANGUAGE': 'en_US:en', 08:29:09 INFO - 'LOGNAME': 'cltbld', 08:29:09 INFO - 'MAIL': '/var/mail/cltbld', 08:29:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:09 INFO - 'MOZ_NO_REMOTE': '1', 08:29:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:29:09 INFO - 'NO_EM_RESTART': '1', 08:29:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:29:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:09 INFO - 'PWD': '/builds/slave/test', 08:29:09 INFO - 'SHELL': '/bin/bash', 08:29:09 INFO - 'SHLVL': '1', 08:29:09 INFO - 'TERM': 'linux', 08:29:09 INFO - 'TMOUT': '86400', 08:29:09 INFO - 'USER': 'cltbld', 08:29:09 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:29:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:09 INFO - '_': '/tools/buildbot/bin/python'} 08:29:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:29:09 INFO - Running setup.py (path:/tmp/pip-918Jca-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:29:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:29:09 INFO - Running setup.py (path:/tmp/pip-Ldu_3u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:29:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:29:09 INFO - Running setup.py (path:/tmp/pip-IwO1tw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:29:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:29:09 INFO - Running setup.py (path:/tmp/pip-YPyQjI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:29:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:29:09 INFO - Running setup.py (path:/tmp/pip-xoLoY5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:29:10 INFO - Running setup.py (path:/tmp/pip-HV5Qg_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:29:10 INFO - Running setup.py (path:/tmp/pip-Amkdxh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:29:10 INFO - Running setup.py (path:/tmp/pip-wtyO76-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:29:10 INFO - Running setup.py (path:/tmp/pip-1OsX0Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:29:10 INFO - Running setup.py (path:/tmp/pip-xgyuLA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:29:10 INFO - Running setup.py (path:/tmp/pip-ssJ9kd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:29:10 INFO - Running setup.py (path:/tmp/pip-2XzO_X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:29:10 INFO - Running setup.py (path:/tmp/pip-tb2yBk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:29:10 INFO - Running setup.py (path:/tmp/pip-82U8RI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:29:10 INFO - Running setup.py (path:/tmp/pip-ZciNKS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:29:10 INFO - Running setup.py (path:/tmp/pip-w4qRQq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:29:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:29:10 INFO - Running setup.py (path:/tmp/pip-C674fy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:29:10 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:29:10 INFO - Running setup.py install for manifestparser 08:29:11 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Running setup.py install for mozcrash 08:29:11 INFO - Running setup.py install for mozdebug 08:29:11 INFO - Running setup.py install for mozdevice 08:29:11 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Running setup.py install for mozfile 08:29:11 INFO - Running setup.py install for mozhttpd 08:29:11 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Running setup.py install for mozinfo 08:29:11 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Running setup.py install for mozInstall 08:29:11 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:29:11 INFO - Running setup.py install for mozleak 08:29:11 INFO - Running setup.py install for mozlog 08:29:11 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:29:12 INFO - Running setup.py install for moznetwork 08:29:12 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:29:12 INFO - Running setup.py install for mozprocess 08:29:12 INFO - Running setup.py install for mozprofile 08:29:12 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:29:12 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:29:12 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:29:12 INFO - Running setup.py install for mozrunner 08:29:12 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:29:12 INFO - Running setup.py install for mozscreenshot 08:29:12 INFO - Running setup.py install for moztest 08:29:12 INFO - Running setup.py install for mozversion 08:29:12 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:29:12 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:29:12 INFO - Cleaning up... 08:29:12 INFO - Return code: 0 08:29:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:29: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')]} 08:29:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29: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')]} 08:29:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:12 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 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:29:12 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 08:29:12 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 08:29:12 INFO - Using env: {'DISPLAY': ':0', 08:29:12 INFO - 'HOME': '/home/cltbld', 08:29:12 INFO - 'LANG': 'en_US.UTF-8', 08:29:12 INFO - 'LANGUAGE': 'en_US:en', 08:29:12 INFO - 'LOGNAME': 'cltbld', 08:29:12 INFO - 'MAIL': '/var/mail/cltbld', 08:29:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:12 INFO - 'MOZ_NO_REMOTE': '1', 08:29:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:29:12 INFO - 'NO_EM_RESTART': '1', 08:29:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:29:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:12 INFO - 'PWD': '/builds/slave/test', 08:29:12 INFO - 'SHELL': '/bin/bash', 08:29:12 INFO - 'SHLVL': '1', 08:29:12 INFO - 'TERM': 'linux', 08:29:12 INFO - 'TMOUT': '86400', 08:29:12 INFO - 'USER': 'cltbld', 08:29:12 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:29:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:12 INFO - '_': '/tools/buildbot/bin/python'} 08:29:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:29:12 INFO - Running setup.py (path:/tmp/pip-W3fQLk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:29:13 INFO - Running setup.py (path:/tmp/pip-No7ncz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:29:13 INFO - Running setup.py (path:/tmp/pip-6hYixS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:29:13 INFO - Running setup.py (path:/tmp/pip-2jXL18-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:29:13 INFO - Running setup.py (path:/tmp/pip-LMjp3J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:29:13 INFO - Running setup.py (path:/tmp/pip-6mtvm2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:29:13 INFO - Running setup.py (path:/tmp/pip-nCxZQt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:29:13 INFO - Running setup.py (path:/tmp/pip-SbWAux-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:29:13 INFO - Running setup.py (path:/tmp/pip-WhrxnK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:29:13 INFO - Running setup.py (path:/tmp/pip-jXybe4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:29:13 INFO - Running setup.py (path:/tmp/pip-fTTcU0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:29:13 INFO - Running setup.py (path:/tmp/pip-hCHkGY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:29:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:29:13 INFO - Running setup.py (path:/tmp/pip-gTpHuH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:29:13 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)) 08:29:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:29:13 INFO - Running setup.py (path:/tmp/pip-RUzDfo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:29:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:29:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:29:14 INFO - Running setup.py (path:/tmp/pip-Xf9hJD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:29:14 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)) 08:29:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:29:14 INFO - Running setup.py (path:/tmp/pip-3ADpx3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:29:14 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)) 08:29:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:29:14 INFO - Running setup.py (path:/tmp/pip-oGVBKx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:29:14 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)) 08:29:14 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)) 08:29:14 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)) 08:29:14 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)) 08:29:14 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)) 08:29:14 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)) 08:29:14 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:29:14 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 08:29:14 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 08:29:14 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 08:29:14 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 08:29:14 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 08:29:14 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 08:29:16 INFO - Downloading blessings-1.6.tar.gz 08:29:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:29:16 INFO - Installing collected packages: blessings 08:29:16 INFO - Running setup.py install for blessings 08:29:16 INFO - Successfully installed blessings 08:29:16 INFO - Cleaning up... 08:29:16 INFO - Return code: 0 08:29:16 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:29:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:29:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:29:16 INFO - Reading from file tmpfile_stdout 08:29:16 INFO - Current package versions: 08:29:16 INFO - argparse == 1.2.1 08:29:16 INFO - blessings == 1.6 08:29:16 INFO - blobuploader == 1.2.4 08:29:16 INFO - docopt == 0.6.1 08:29:16 INFO - functools32 == 3.2.3-2 08:29:16 INFO - jsonschema == 2.5.1 08:29:16 INFO - manifestparser == 1.1 08:29:16 INFO - mozInstall == 1.12 08:29:16 INFO - mozcrash == 0.17 08:29:16 INFO - mozdebug == 0.1 08:29:16 INFO - mozdevice == 0.48 08:29:16 INFO - mozfile == 1.2 08:29:16 INFO - mozhttpd == 0.7 08:29:16 INFO - mozinfo == 0.9 08:29:16 INFO - mozleak == 0.1 08:29:16 INFO - mozlog == 3.2 08:29:16 INFO - moznetwork == 0.27 08:29:16 INFO - mozprocess == 0.22 08:29:16 INFO - mozprofile == 0.28 08:29:16 INFO - mozrunner == 6.11 08:29:16 INFO - mozscreenshot == 0.1 08:29:16 INFO - mozsystemmonitor == 0.3 08:29:16 INFO - moztest == 0.7 08:29:16 INFO - mozversion == 1.4 08:29:16 INFO - psutil == 3.1.1 08:29:16 INFO - requests == 1.2.3 08:29:16 INFO - wsgiref == 0.1.2 08:29:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:29:16 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')]} 08:29:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:16 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')]} 08:29:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:16 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 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:29:16 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 08:29:16 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 08:29:16 INFO - Using env: {'DISPLAY': ':0', 08:29:16 INFO - 'HOME': '/home/cltbld', 08:29:16 INFO - 'LANG': 'en_US.UTF-8', 08:29:16 INFO - 'LANGUAGE': 'en_US:en', 08:29:16 INFO - 'LOGNAME': 'cltbld', 08:29:16 INFO - 'MAIL': '/var/mail/cltbld', 08:29:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:16 INFO - 'MOZ_NO_REMOTE': '1', 08:29:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:29:16 INFO - 'NO_EM_RESTART': '1', 08:29:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:29:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:16 INFO - 'PWD': '/builds/slave/test', 08:29:16 INFO - 'SHELL': '/bin/bash', 08:29:16 INFO - 'SHLVL': '1', 08:29:16 INFO - 'TERM': 'linux', 08:29:16 INFO - 'TMOUT': '86400', 08:29:16 INFO - 'USER': 'cltbld', 08:29:16 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:29:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:16 INFO - '_': '/tools/buildbot/bin/python'} 08:29:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 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)) 08:29:16 INFO - Cleaning up... 08:29:16 INFO - Return code: 0 08:29:16 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:29:16 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')]} 08:29:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:29:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:16 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')]} 08:29:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:29:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:29:16 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 0xfff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c0180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, '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': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', '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 08:29:16 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 08:29:16 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 08:29:16 INFO - Using env: {'DISPLAY': ':0', 08:29:16 INFO - 'HOME': '/home/cltbld', 08:29:16 INFO - 'LANG': 'en_US.UTF-8', 08:29:16 INFO - 'LANGUAGE': 'en_US:en', 08:29:16 INFO - 'LOGNAME': 'cltbld', 08:29:16 INFO - 'MAIL': '/var/mail/cltbld', 08:29:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:16 INFO - 'MOZ_NO_REMOTE': '1', 08:29:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:29:16 INFO - 'NO_EM_RESTART': '1', 08:29:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:29:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:16 INFO - 'PWD': '/builds/slave/test', 08:29:16 INFO - 'SHELL': '/bin/bash', 08:29:16 INFO - 'SHLVL': '1', 08:29:16 INFO - 'TERM': 'linux', 08:29:16 INFO - 'TMOUT': '86400', 08:29:16 INFO - 'USER': 'cltbld', 08:29:16 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:29:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:16 INFO - '_': '/tools/buildbot/bin/python'} 08:29:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:29:17 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:29:17 INFO - Cleaning up... 08:29:17 INFO - Return code: 0 08:29:17 INFO - Running post-action listener: _resource_record_post_action 08:29:17 INFO - Running post-action listener: _start_resource_monitoring 08:29:17 INFO - Starting resource monitoring. 08:29:17 INFO - ##### 08:29:17 INFO - ##### Finished create-virtualenv step (success) 08:29:17 INFO - ##### 08:29:17 INFO - ##### 08:29:17 INFO - ##### Running install step. 08:29:17 INFO - ##### 08:29:17 INFO - Running pre-action listener: _resource_record_pre_action 08:29:17 INFO - Running main action method: install 08:29:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:29:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:29:17 INFO - Reading from file tmpfile_stdout 08:29:17 INFO - Detecting whether we're running mozinstall >=1.0... 08:29:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:29:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:29:17 INFO - Reading from file tmpfile_stdout 08:29:17 INFO - Output received: 08:29:17 INFO - Usage: mozinstall [options] installer 08:29:17 INFO - Options: 08:29:17 INFO - -h, --help show this help message and exit 08:29:17 INFO - -d DEST, --destination=DEST 08:29:17 INFO - Directory to install application into. [default: 08:29:17 INFO - "/builds/slave/test"] 08:29:17 INFO - --app=APP Application being installed. [default: firefox] 08:29:17 INFO - mkdir: /builds/slave/test/build/application 08:29:17 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'] 08:29:17 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 08:29:33 INFO - Reading from file tmpfile_stdout 08:29:33 INFO - Output received: 08:29:33 INFO - /builds/slave/test/build/application/firefox/firefox 08:29:33 INFO - Running post-action listener: _resource_record_post_action 08:29:33 INFO - ##### 08:29:33 INFO - ##### Finished install step (success) 08:29:33 INFO - ##### 08:29:33 INFO - ##### 08:29:33 INFO - ##### Running run-tests step. 08:29:33 INFO - ##### 08:29:33 INFO - Running pre-action listener: _resource_record_pre_action 08:29:33 INFO - Running main action method: run_tests 08:29:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:29:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:29:33 INFO - Python 2.7.3 08:29:33 INFO - Return code: 0 08:29:33 INFO - grabbing minidump binary from tooltool 08:29:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:29:33 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 0x12be3b0>, '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 0x12bf2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bf740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:29:33 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 08:29:33 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 08:29:33 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 08:29:33 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:29:33 INFO - Return code: 0 08:29:33 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:29:33 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:29:33 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:29:33 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:29:33 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:29:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-048', '--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 08:29:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-048 --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 08:29:33 INFO - Using env: {'DISPLAY': ':0', 08:29:33 INFO - 'HOME': '/home/cltbld', 08:29:33 INFO - 'LANG': 'en_US.UTF-8', 08:29:33 INFO - 'LANGUAGE': 'en_US:en', 08:29:33 INFO - 'LOGNAME': 'cltbld', 08:29:33 INFO - 'MAIL': '/var/mail/cltbld', 08:29:33 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:29:33 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:29:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:29:33 INFO - 'MOZ_NO_REMOTE': '1', 08:29:33 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:29:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:29:33 INFO - 'NO_EM_RESTART': '1', 08:29:33 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:29:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:29:33 INFO - 'PWD': '/builds/slave/test', 08:29:33 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:29:33 INFO - 'SHELL': '/bin/bash', 08:29:33 INFO - 'SHLVL': '1', 08:29:33 INFO - 'TERM': 'linux', 08:29:33 INFO - 'TMOUT': '86400', 08:29:33 INFO - 'USER': 'cltbld', 08:29:33 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619', 08:29:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:29:33 INFO - '_': '/tools/buildbot/bin/python'} 08:29:33 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-048', '--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 08:29:33 INFO - mozversion application_buildid: 20160629071428 08:29:33 INFO - mozversion application_changeset: b69a5bbb5e40bd426e35222baa600b481e50d265 08:29:33 INFO - mozversion application_display_name: Nightly 08:29:33 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:29:33 INFO - mozversion application_name: Firefox 08:29:33 INFO - mozversion application_remotingname: firefox 08:29:33 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 08:29:33 INFO - mozversion application_vendor: Mozilla 08:29:33 INFO - mozversion application_version: 50.0a1 08:29:33 INFO - mozversion platform_buildid: 20160629071428 08:29:33 INFO - mozversion platform_changeset: b69a5bbb5e40bd426e35222baa600b481e50d265 08:29:33 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 08:29:33 INFO - mozversion platform_version: 50.0a1 08:29:33 INFO - using testdate: 1467214173 08:29:33 INFO - actual date: 1467214173 08:29:33 INFO - starting webserver on 'localhost:50827' 08:29:33 INFO - SUITE-START | Running 2 tests 08:29:33 INFO - TEST-START | dromaeo_css 08:29:33 INFO - operating with platform_type : linux_ 08:29:33 INFO - Initialising browser for dromaeo_css test... 08:29:33 INFO - TEST-INFO | started process 15647 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUmwVp9/profile http://localhost:50827/getInfo.html) 08:29:38 INFO - PROCESS | 15647 | __metrics Screen width/height:1600/1200 08:29:38 INFO - PROCESS | 15647 | colorDepth:24 08:29:38 INFO - PROCESS | 15647 | Browser inner width/height: 1024/697 08:29:38 INFO - PROCESS | 15647 | __metrics 08:29:39 INFO - PROCESS | 15647 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:29:40 INFO - TEST-INFO | 15647: exit 0 08:29:40 INFO - Browser initialized. 08:29:40 INFO - Running cycle 1/1 for dromaeo_css test... 08:29:40 INFO - TEST-INFO | started process 15729 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUmwVp9/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:29:52 INFO - PROCESS | 15729 | RSS: Main: 158482432 08:29:52 INFO - PROCESS | 15729 | 08:30:44 INFO - PROCESS | 15729 | 1467214244423 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] 08:32:56 INFO - PROCESS | 15729 | Cycle 1(1): loaded http://localhost:50827/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50827/tests/dromaeo/cssquery-ext.html) 08:32:57 INFO - PROCESS | 15729 | RSS: Main: 267907072 08:32:57 INFO - PROCESS | 15729 | 08:36:00 INFO - PROCESS | 15729 | Cycle 1(1): loaded http://localhost:50827/tests/dromaeo/cssquery-ext.html (next: http://localhost:50827/tests/dromaeo/cssquery-jquery.html) 08:36:01 INFO - PROCESS | 15729 | RSS: Main: 243032064 08:36:01 INFO - PROCESS | 15729 | 08:39:03 INFO - PROCESS | 15729 | Cycle 1(1): loaded http://localhost:50827/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50827/tests/dromaeo/cssquery-mootools.html) 08:39:03 INFO - PROCESS | 15729 | RSS: Main: 244002816 08:39:03 INFO - PROCESS | 15729 | 08:42:05 INFO - PROCESS | 15729 | Cycle 1(1): loaded http://localhost:50827/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50827/tests/dromaeo/cssquery-prototype.html) 08:42:06 INFO - PROCESS | 15729 | RSS: Main: 241913856 08:42:06 INFO - PROCESS | 15729 | 08:45:09 INFO - PROCESS | 15729 | Cycle 1(1): loaded http://localhost:50827/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50827/tests/dromaeo/cssquery-yui.html) 08:45:10 INFO - PROCESS | 15729 | RSS: Main: 226897920 08:45:10 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | Cycle 1(1): loaded http://localhost:50827/tests/dromaeo/cssquery-yui.html (next: http://localhost:50827/tests/dromaeo/cssquery-dojo.html) 08:48:12 INFO - PROCESS | 15729 | RSS: Main: 283578368 08:48:12 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | __start_tp_report 08:48:12 INFO - PROCESS | 15729 | _x_x_mozilla_page_load 08:48:12 INFO - PROCESS | 15729 | _x_x_mozilla_page_load_details 08:48:12 INFO - PROCESS | 15729 | |i|pagename|runs| 08:48:12 INFO - PROCESS | 15729 | |0;dojo.html;2658.17596545071;2670.6928703199137;2709.0924540279007;2714.0772137473255;2714.5656694928816;4706.529347065291;4790.880227994302;4804.447488538819;4850.757462126889;4892.804287828487;4765.8808529786775;4773.236282194849;4778.52214778522;4813.759312034402;4822.9035419291595;4308.590683885026;4367.08291258836;4397.626201772853;4411.470623525165;4583.954160458403;4524;4527.750973696446;4547.636189104864;4553.453585569736;4602.769861506928;4302.311630139163;4337.761423121727;4346.608805207515;4381.496127945264;4442.822287108512;4396.274614688573;4399.340098985146;4407.691461597689;4483.955160448387;4486.304622783474;4431.933520997188;4432.20220360335;4450.376947227391;4472.664550158751;4478.977605111986;4668.953310466886;4800.543948324904;4815.205491093965;4819.59033482151;4859.295402166701;5067.138586440314;5073.695578265316;5090.592752579785;5117.7185254810975;5196.142636464979;5146.974265128688;5164.870878228036;5172.353455818023;5206.97396513015;5212.739363031871;4754.667173297836;4809.110314591811;4814.662973591885;4840.1287768201355;4854.708717476963;5325.201219817059;5379.78480860769;5386.59600529954;5424.566034717213;5439.3200849893765;5149.6910185389;5162.9741851291255;5202.479752024768;5212.661177023481;5213.530782229542;4963.851084467472;5134.48655134491;5180.715060671624;5293.867653308698;5303.204519322133;5179.45615710345;5183.352080989876;5185.144451165591;5207.062728708869;5214.348206474191;5135.050015747099;5136.948630513647;5156.664816786897;5163.638545301868;5199.740012999335;4328.394024836525;4368.759718215529;4378.255696531597;4401.383806267125;4415.492218394926;3769.26499332633;3809.8476060957805;3812.4853144825092;3865.2849222893856;3898.4542164097047;4397.362382454527;4398.516163222043;4404.031113155101;4442.622377097919;4446.510883802779;5052.267421223902;5137.743112844343;5138.743062846843;5140.460251673595;5187.04039752647;4339.631131353807;4365.214261432972;4395.7362558246605;4396.230659634615;4407.581279778416;4635.953640463552;4636.976815115903;4643.141018911445;4644.58198762113;4695.5304469552775;4769.3084502746215;4853.538913803183;4861.808856830099;4867.659263851497;4909.337239472697;5145.819896303611;5188.533032027136;5202.089634314056;5207.114790485551;5220.791168353223;4889.926651100165;4894.535019173173;4897;4904.239842824368;4946.777395017161;4939;5047.747612619428;5133.512316329943;5134.281200631989;5135.460776618551;5122.436531981404;5164.457731938092;5179.482051794941;5184.507471790174;5236.476352364733;4996.425411077773;5005.099082165245;5007.599392048554;5008.899822003613;5058.494150585059;4878.512148785235;4977.502249775139;4992.301077849177;5008.048470790538;5013.974930125326;4946.3817022872145;4953.777080031479;4983;4984.1526940420945;4988.6757360771435;5076.82231121909;5089;5090.847274581768;5091.134507133722;5137.897242055213;4859.3682821233015;4867.464578896248;4901.215805471107;4906.950930490792;4967.428745694291 08:48:12 INFO - PROCESS | 15729 | |1;ext.html;581.8254523642906;586.5014737473149;590.1354515634595;595.4938302442921;600.3726106218998;26828.86585567072;40095.39856902149;41438.58561414381;41581.79209103958;45543;42092.15815683684;42099.368509472384;42157.578424215746;42456;42588;7556.206598307181;7638.618069096537;7781.26078022587;7789.260020298063;7790;7633.847323053536;7743.419243556727;7748.070231572191;9855.605775768961;10197.541110650038;10132.442715650635;10182.083612474877;10195.592176312939;10197.235207359441;10202.591896324175;9935;10017.899821001842;10019.44893030883;10020.148287395506;10020.298579099503;7471.327580517725;7717.459777815499;7719.228077192292;9582.28132890036;10034.197264218918;37845;38064.61935380666;38118.809405952794;38150.61849381498;38172.42741358882;2999.8350090745002;3086.2130156810094;3131.3580715953403;3161.225499752575;3238.9028329150165;28755.424891502054;28858.567121493194;29400.11799646014;29439.558406623917;29456.11631651054;3151.2121969507625;3358.5969683637877;3358.7648864579487;3407.6762707542744;3440.8107554084513;164072;164660;164792;165262;165680;48342.27486587704;54383.45616543784;56095.15857262144;56261.7186914071;61628.691856540434;57318.14022789661;57596.712016440484;57653;57823.710881445324;57876.421235787944;14665.853341466449;14740.41038358475;14758.114513129247;14768.040077394935;14771.261436928111;10987.450627468595;11987.940060299643;12080.395980200954;12087.697807554881;12167.148299619119;17563.56091097733;17989.460316190536;18065.909670451565;18277.3602923897;18510;6852.828679282959;6961.338672826073;6969.6515174241085;6989.720411183495;7064.551766887776;759.4835511851994;872.4983134697447;905.1265528764642;930.6230976454547;958.5494817435793;27748;28329.29176770556;28427.28931776722;28518.287042824097;28905.277368065545;938.8122375524922;967.2455484721787;972.7470857577081;1055.7466208110152;1085.7448499602588;14748;15231;15261;15273.159976201194;15480.767788483181;392481;397270;397497;397914;398029;50258;50636.240456393185;50686.746566266935;50687.239691404655;50699.23951140736;1099.7745462180235;1121.287982131336;1179.6991767099335;1220.664317312746;1230.4831970572382;25952.740472595033;28572.285692857844;28713.71286287194;29257.561136582543;29311.560326594692;41304.58695413128;41364;41790;41819.7909010453;41843.7907810459;295917;297313;298073;298341;301105;22366.66450003284;24437.38906527351;24539.263822085366;25371.112011080262;25474.23577292684;41652.37521437241;41923.37114943339;42297.22237484189;42415;42703.3594496089;36178.4573231407;36470.08824779402;36538.8173059133;37091.07272318214;37370.43944340891;36212;36641.26717465689;36657.63342366649;36657.816710916275;37272.44091338578;34011.31977360488;34129.31741365208;34731.4790278141;34939.82530087333;35031.649683503856;31844.52233216457;32269.67730322667;32297.35405291928;32475;32900.50649240216;24901.87549062243;25055.248342549752;25274.74725252724;25379.74620253774;25552.105676301984 08:48:12 INFO - PROCESS | 15729 | |2;jquery.html;369.5749887629226;375.5981100222762;383.06914198497674;392.65642562757586;396.36383604315074;16688.582785430353;17201.65596688067;17848.55378615532;18113.728294075565;18143.637127257447;10889.945550272258;10891.455427228626;11039.227254092217;11108.055815255713;11153.776924461506;4481.551844815509;4621.560951709591;5328.333958255218;5362.034833729927;5364.6781193128345;5209.817656382027;5299.947000529984;5319.122344813101;5339.439358867321;5347.197920311945;4666.113438446701;4736.834210802623;4755.619550435957;4762.547557982003;5316.601254905898;4713.269443236304;4715.7170569765585;4722.244440889442;4724.858254252378;4738.502457241992;4550.47669518003;4576.084783043405;4642.51253618372;4654.045920586272;4670.159371313162;12126;12131.757364852741;12183.451744671422;12195.45120469581;12208.816867746991;1894.886306821595;1905.9047047647562;1937.5834195648004;2016.5865997470482;2042.2443695832637;9156.908430915671;9213.401128926598;9604.08761167688;9664.130228279488;9808.117269445713;1714.1086634949756;1781.2073627235886;1785.8214178582168;1786.178357955342;1825.1695478557224;72666.76313123996;74201.6289918547;75134;75248.24751752522;76754.61622691852;10002.599896004078;10166.542505587266;10260.333078349884;10296.124829389437;10548.789024219474;14162.079464834753;14297.928510357382;14305.78541321881;14334.856651433562;14358.712825743636;7331.596762178131;7394.852102957911;7467.327940485274;7524.9247507525315;7569;6963.721451141898;7109.253528379549;7145.243382396356;7252.057232559733;7306.159791624032;4396.340548917688;4456.821727130879;4458.888527786767;4485.372047913294;4615.353850460938;1733.3673209278522;1785.6339450412634;1837.0148508673406;1874.3158747057225;1919.1555715485142;805.2269820971816;886.8492356299445;895.892492900856;919.1957037592107;967.3325405470204;16751.413700520425;16825;17522.21150048251;17646.823531764774;17755.11224438773;808.6644042722322;827.9503229806231;878.310526236901;885.0574138542431;895.6820328783318;9641.710748677551;9856.162226210708;9896.950515247521;9900.752481188028;9902.80194396108;316761;321411;430513;433472;434045;83748.58125709454;85432.57283713542;85675.57162214149;87539;87878.12121878828;767.4857845243589;899.9460032398077;911.8951320598084;936.3866667332908;939.455116032713;14687.339069741674;15089.698206036037;15688.529344119695;16385.344586216896;16752.413665522137;37915.62084379121;39151.41272880966;39314.606853931095;39429;39838.60161398465;49839.75080124576;51419.48580514147;52374.476255238485;52489;52768.208476873646;6980.965095174492;7270.818229544304;7282.453815963718;7284.053073100463;7390.445716571171;5918.704064796829;9078.682246121354;9114.589843456928;9261.53692315395;11276.548938042715;9248.537573121183;9305.767355816159;9379.10898464672;9451.810963780548;9638.277129215478;9382.530873456164;9449.811003779749;9859.654912078044;9967.40195588267;10151.79696406053;9268.165865071906;9652.855207172039;9861.408315501092;9861.802763944537;10101.393916365041;7254.347108760026;7347.33873951347;7389.667464964197;7418.925810741824;7442.9255707442235;8782.253508451853;9193.402428842104;9230.446173229628;9288.256939444964;9364.250859931326 08:48:12 INFO - PROCESS | 15729 | |3;mootools.html;1362.6865820861199;1408.162143524603;1475.461456568352;1698.8895721778076;1714.2457318779727;7378;7859;7947;7956.960215198923;7958.562279074648;6776.796696099125;7443.255674432554;7695.345895598867;7729.61351932404;7740.535567865932;2211.5355775287167;2229.576380487702;2233.0174723121772;2233.8771367574777;2241.8991145398413;2215.125025614881;2226.309843948373;2245.2815099168274;2251.7748225177434;2255.977440225601;1872.681644120496;1950.4051264364364;2035.2571311471354;2038.7655419626785;2043.0806137238228;2167.674848772681;2169.620316444616;2190.912363505458;2195.890205489727;2205.6691496275525;2235.8770267635437;2255.064148378421;2255.977440225593;2259.8757068361233;2259.8757068361233;7683.923160768377;7732.961335193288;7734.806629834243;7739.806504837367;7740.53556786589;4517;4662.090892276007;4670.276107203389;4671.089137618166;4672.696274742131;2830.915072547806;2836.801423900328;2977.955330670042;2997.220722612115;2998.880044798227;919;938.5072836760687;941.6562954521619;954.19370631816;964.262339310428;10625.362478251329;10748.193885458544;10863.619773307975;10877.782444351069;10878.401687907162;3990.3415936370175;4056.817443215062;4194.119234960632;4221.430106935524;4233.174530966494;9249.768755781159;9299;9300.72097837066;9303.209227215762;9306.441613503212;4522.050369422393;4605.424321959755;4655.185342565038;4658.720476771405;4660.627149828006;4172.853950111731;4202.957970420318;4253.490011046096;4254.574542545721;4258.61672449481;3499;3548.591911930161;3556.7865928043884;3601.6758491735345;3602.5136606558303;1082.9891701082888;1108.7560736637927;1112.2770199370311;1120.7758448310371;1127.0363838917608;709.794159693683;765.7052034966578;816.8978877640295;849.7705619482705;850.6767428377301;4950.975245123751;5170.45710200431;5211.713355765393;5289.841304760864;5375.247465354853;422.343256236549;435.3100335967464;438.8135042606943;449.97075190112537;589.2163422647868;3583.552055993001;3641.1625326175126;3672.155404257036;3675.5405574303213;3693.759905606127;9588.089131532633;9890.851637225447;9968.053034961667;10002.599896004223;10016.949915250523;8565.357598180162;8859.955700221457;9733.902660973441;9829.164521015651;9864.260180486348;7079.39825114871;7341.302576255247;7352.669129889167;7353.411727061823;7357.484976051625;5356.491133342326;5416.647917885325;5519.668819870821;5574.386817449996;5584.357798853184;8759.562021898751;8982.236509896731;9043.18611324984;9060.909390906007;9063.274938005075;8821.867671984797;8872.911270887209;8900.77748056278;8998.550072496218;9147;6625.238097618835;6685.498587606046;6695.230048544285;6703.463722902058;6758.662066896733;7326.487145899736;7458.813529661802;7476;7489.176190619137;7490.850182996201;5183.533481986639;6700.698468569024;6779.186497620317;6821.727130914708;7077.716891324495;6733.091032710521;6846.486513511407;6884.759033433806;6884.967254911803;6987.930120698931;6107.450329470369;6115.571909966259;6169.598976066542;6173.660448675366;6174.320824709189;4592.931106033346;4646.4191976003;4709.929351059805;4734.502877197982;4799.688020278671;4675.368825208553;4682.742449165193;4688.531146885284;4714.292856071616;4768.928466072943 08:48:12 INFO - PROCESS | 15729 | |4;prototype.html;293.7048266492175;301.9199912023314;305.33132439956495;306.5723315974216;311.377245508982;4771.618270538353;4779.474257831635;4785.880352991177;4824.445188803289;4828.203346447836;4500.997056309935;4607.608353289966;4631.421072365954;4761.619070474362;4776.832810851621;3775.6790672792845;3797;3817.6945844332386;3823.2735780201674;3824.3116239076885;3802.5817160112365;3813.7139714521522;3826.961730382702;3829.6936245100324;3841.5966323536045;3588.156783155969;3647.908802279938;3756.9436458453147;3768.1144930941205;3786.9775160706595;3758.68051215647;3773.716971227169;3775.093977445407;3777.678897293747;3783.921582349017;3380.695737383647;3387.4580067189377;3389.1188291044505;3392.8133952632597;3399.1841957930164;4449.17690227309;4667.766611669403;4686.367340409035;4693.272542755878;4697.154512187805;4353.390525326457;4377.183468860451;4381.130359614458;4384.56154384559;4392.692511524195;5045.772940217699;5047.520485553867;5056.747162641853;5065.138926382524;5066.594672426234;3623.3840247158046;3726.496922915399;3729.160938788778;3729.981350093259;3730.552333719944;5218.817341393071;5239.449857764956;5244.921326180111;5254.369475662945;5272.789088436458;3805.7145714071557;3812.5043744313616;3812.8856134316015;3828.3874580067054;3834.271488417192;3875.1592993327945;3877.43777152317;3883.611638836094;3884.6309600587897;3885.786281754474;4234.3860140279485;4345.97827010863;4350.868774118752;4353.934690979638;4360.694751367438;5015.799368025311;5028.446870844205;5041;5041.6722913010535;5056.395956082621;1257.4844313831286;1283.6521652265085;1330.8735670111519;1343.3753304713355;1343.9462421503226;906.8685040669066;912.5209265135857;927.5854322158627;932.2262522106636;932.8087742012871;4415.448068991376;4419.11617676466;4439.311906654474;4442.244818380883;4452.063352441698;5127.897442051138;5130.769115389817;5135.820246291362;5138.717370544656;5146.761158895893;4423.535528769497;4443.289073748249;4446.221911165533;4447.355133505624;4447.710898791568;2595.2214335699214;2744.217897899089;2751.2021513760783;2751.7385848344375;2769.141566114511;4912.680675756064;4914.631402644816;4922.433920099163;4924.8276310328965;4929.866130789938;5068.6451948363265;5288.603354748409;5311.7078560678765;5337.786488540415;5340.359156901197;4939.753012349368;4946.282788995575;4946.975265123651;4957.975210123926;4962.727050012284;5237.790488380422;5242.7902883885745;5254.868628284324;5258.684478931276;5267.183586544092;4918.754062296943;5137.280780690781;5154.14956532183;5159.09715799741;5176.9741151294;4966.106100901728;4976.278439626306;4978.477259887804;4987.251912213052;4992;3734.3464893644045;3745.7190710696264;3748.55017397914;3754.3992961126087;3764.9058773529787;5003.4246061701915;5172.922406163986;5226.719453733859;5280.735963201748;5287;5061.848144555669;5070.036693028313;5082.085224659449;5093.261477085876;5111.182210846247;5056.443791182894;5059.6458247923765;5063.8480845574695;5073.441921388718;5078.238264260242;4717.834875779331;4970.577500912318;4971.776270067783;4990.351254336913;5001.299818025552;5076.2740668173;5111.335526381696;5114.491225088682;5117.130087884994;5121.1550094234035;4996.15065438869;5012.373453318335;5016.473270306566;5025.673331233458;5031.421386540448 08:48:12 INFO - PROCESS | 15729 | |5;yui.html;575.7265298982984;601.7502736364409;601.9067044608088;655.5411212151494;682.5358756045887;11581.65255042349;12433;12460.81308780369;12506.124571280003;12513;11076.833847492295;12353.135280530367;12353.691157721061;12362.381880905963;12363.876361236407;625.109219362409;769.1308821032226;770.5415277909635;779.3531368963746;787.4920676163871;784.8979632647777;786.5202226641744;791;791.1376599506536;791.651673263765;830.9418340716152;832.6003518311214;832.8875601793741;832.8958880139983;833.2334252487726;659.0608383054129;668.2415458454641;671.4863129705778;678.1794029224644;829.5727700234385;587.4272584230341;603.9849003774897;604.7520516588178;604.7520516588178;605.3492495567283;11778.823317650242;11784.410779461079;11798.41007949599;11812.763744725144;11827.822582661267;10782.191335649779;11088.889111108867;11513.194076414655;12074;12173.391330433444;11516.654500365003;11533.423328833525;11761.470733816914;11768.117391195608;11851.881481185164;4125.855595054189;4177.540470548237;4217.198732240895;4284.5715428457215;4301.354796780508;61588.38411615871;64730.029049564764;64826.351736482975;64891;65482;10008.499575021366;10022.699319020441;10121.392716437038;10140.239482038876;10141.340812847142;16924.238409271613;17054.914725426293;17121.14394280306;17158.48524544266;17183.914080429768;6456.386643268882;6567.9671601641685;6667.799966001027;6765.695543700545;6830.795076147723;3335.499675048762;3539.911502212465;3585.408407612767;3600.369935261371;3602.297551977392;2675.050357123232;2765.1704488653727;2765.6542932133484;2767.4326763013532;2768.1972228053637;491.5551425959512;491.9852404427873;493.10009233149646;508.86006348253784;510.2346480279581;454.8771831605514;491.130698663371;512.4977522028433;526.1003683700915;527.5990247411994;7325.194228634846;7536.24637536242;7563.810904727426;7848.882266766003;7941.880871786928;454.87263566201517;466.59173223429497;485.74983883300126;492.46567474290794;518.3831240823483;3851.651921827394;3894.668953139015;3903.2974064668065;4042.7372220805555;4093.099518106012;54607.45392546103;54699.179512307346;79736.20263797404;95888.52055739677;97839;80751.59624201841;81450.59274703589;81715;82606;83479.16520834835;73392.63303683554;75886.24113758902;76590;77885.2211477878;78034.6098269505;7418.703251870081;7450.478466507509;7523.172451030492;7662.017884023195;7729.304362607392;39282.410763837994;44922.77538612286;45544.316835246835;45990;46155;64760.352396475435;65026;65427;65482.34517654763;65697.67151164214;9257.094166138248;9387.671431499864;9493.382930109521;9511.619535218513;9582.28132890022;10868.67393978182;10957.726056848642;10984.231103822656;11201.103911687209;11529.596464123715;10169.89830101719;10242.283040187413;10442.68671939843;10490.632827850988;10749.731256718645;10203.693889183336;10591.364518128628;10657.89342106569;10738.409387483764;10777.407242601732;9993.10062094415;10052.497375131361;10138.341007834468;10159.949200254247;10457.790844183226;8210.876836847572;8424.915750842412;8488.74533763988;8782.604782784918;8828.823423531621;7935.2064793520185;8015.278624923785;8176.345892328481;8290.170982901662;8511.914880851113 08:48:12 INFO - PROCESS | 15729 | __end_tp_report 08:48:12 INFO - PROCESS | 15729 | __start_cc_report 08:48:12 INFO - PROCESS | 15729 | _x_x_mozilla_cycle_collect,1016 08:48:12 INFO - PROCESS | 15729 | __end_cc_report 08:48:12 INFO - PROCESS | 15729 | __startTimestamp1467215292923__endTimestamp 08:48:12 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | ------- Summary: start ------- 08:48:12 INFO - PROCESS | 15729 | Number of tests: 6 08:48:12 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | [#0] dojo.html Cycles:165 Average:4771.77 Median:4892.80 stddev:507.98 (10.4%) stddev-sans-first:481.72 08:48:12 INFO - PROCESS | 15729 | Values: 2658.2 2670.7 2709.1 2714.1 2714.6 4706.5 4790.9 4804.4 4850.8 4892.8 4765.9 4773.2 4778.5 4813.8 4822.9 4308.6 4367.1 4397.6 4411.5 4584.0 4524.0 4527.8 4547.6 4553.5 4602.8 4302.3 4337.8 4346.6 4381.5 4442.8 4396.3 4399.3 4407.7 4484.0 4486.3 4431.9 4432.2 4450.4 4472.7 4479.0 4669.0 4800.5 4815.2 4819.6 4859.3 5067.1 5073.7 5090.6 5117.7 5196.1 5147.0 5164.9 5172.4 5207.0 5212.7 4754.7 4809.1 4814.7 4840.1 4854.7 5325.2 5379.8 5386.6 5424.6 5439.3 5149.7 5163.0 5202.5 5212.7 5213.5 4963.9 5134.5 5180.7 5293.9 5303.2 5179.5 5183.4 5185.1 5207.1 5214.3 5135.1 5136.9 5156.7 5163.6 5199.7 4328.4 4368.8 4378.3 4401.4 4415.5 3769.3 3809.8 3812.5 3865.3 3898.5 4397.4 4398.5 4404.0 4442.6 4446.5 5052.3 5137.7 5138.7 5140.5 5187.0 4339.6 4365.2 4395.7 4396.2 4407.6 4636.0 4637.0 4643.1 4644.6 4695.5 4769.3 4853.5 4861.8 4867.7 4909.3 5145.8 5188.5 5202.1 5207.1 5220.8 4889.9 4894.5 4897.0 4904.2 4946.8 4939.0 5047.7 5133.5 5134.3 5135.5 5122.4 5164.5 5179.5 5184.5 5236.5 4996.4 5005.1 5007.6 5008.9 5058.5 4878.5 4977.5 4992.3 5008.0 5014.0 4946.4 4953.8 4983.0 4984.2 4988.7 5076.8 5089.0 5090.8 5091.1 5137.9 4859.4 4867.5 4901.2 4907.0 4967.4 08:48:12 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | [#1] ext.html Cycles:180 Average:45124.66 Median:19086.14 stddev:79704.57 (417.6%) stddev-sans-first:79858.00 08:48:12 INFO - PROCESS | 15729 | Values: 581.8 586.5 590.1 595.5 600.4 26828.9 40095.4 41438.6 41581.8 45543.0 42092.2 42099.4 42157.6 42456.0 42588.0 7556.2 7638.6 7781.3 7789.3 7790.0 7633.8 7743.4 7748.1 9855.6 10197.5 10132.4 10182.1 10195.6 10197.2 10202.6 9935.0 10017.9 10019.4 10020.1 10020.3 7471.3 7717.5 7719.2 9582.3 10034.2 37845.0 38064.6 38118.8 38150.6 38172.4 2999.8 3086.2 3131.4 3161.2 3238.9 28755.4 28858.6 29400.1 29439.6 29456.1 3151.2 3358.6 3358.8 3407.7 3440.8 164072.0 164660.0 164792.0 165262.0 165680.0 48342.3 54383.5 56095.2 56261.7 61628.7 57318.1 57596.7 57653.0 57823.7 57876.4 14665.9 14740.4 14758.1 14768.0 14771.3 10987.5 11987.9 12080.4 12087.7 12167.1 17563.6 17989.5 18065.9 18277.4 18510.0 6852.8 6961.3 6969.7 6989.7 7064.6 759.5 872.5 905.1 930.6 958.5 27748.0 28329.3 28427.3 28518.3 28905.3 938.8 967.2 972.7 1055.7 1085.7 14748.0 15231.0 15261.0 15273.2 15480.8 392481.0 397270.0 397497.0 397914.0 398029.0 50258.0 50636.2 50686.7 50687.2 50699.2 1099.8 1121.3 1179.7 1220.7 1230.5 25952.7 28572.3 28713.7 29257.6 29311.6 41304.6 41364.0 41790.0 41819.8 41843.8 295917.0 297313.0 298073.0 298341.0 301105.0 22366.7 24437.4 24539.3 25371.1 25474.2 41652.4 41923.4 42297.2 42415.0 42703.4 36178.5 36470.1 36538.8 37091.1 37370.4 36212.0 36641.3 36657.6 36657.8 37272.4 34011.3 34129.3 34731.5 34939.8 35031.6 31844.5 32269.7 32297.4 32475.0 32900.5 24901.9 25055.2 25274.7 25379.7 25552.1 08:48:12 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | [#2] jquery.html Cycles:180 Average:24181.43 Median:28314.65 stddev:65086.84 (229.9%) stddev-sans-first:65244.87 08:48:12 INFO - PROCESS | 15729 | Values: 369.6 375.6 383.1 392.7 396.4 16688.6 17201.7 17848.6 18113.7 18143.6 10889.9 10891.5 11039.2 11108.1 11153.8 4481.6 4621.6 5328.3 5362.0 5364.7 5209.8 5299.9 5319.1 5339.4 5347.2 4666.1 4736.8 4755.6 4762.5 5316.6 4713.3 4715.7 4722.2 4724.9 4738.5 4550.5 4576.1 4642.5 4654.0 4670.2 12126.0 12131.8 12183.5 12195.5 12208.8 1894.9 1905.9 1937.6 2016.6 2042.2 9156.9 9213.4 9604.1 9664.1 9808.1 1714.1 1781.2 1785.8 1786.2 1825.2 72666.8 74201.6 75134.0 75248.2 76754.6 10002.6 10166.5 10260.3 10296.1 10548.8 14162.1 14297.9 14305.8 14334.9 14358.7 7331.6 7394.9 7467.3 7524.9 7569.0 6963.7 7109.3 7145.2 7252.1 7306.2 4396.3 4456.8 4458.9 4485.4 4615.4 1733.4 1785.6 1837.0 1874.3 1919.2 805.2 886.8 895.9 919.2 967.3 16751.4 16825.0 17522.2 17646.8 17755.1 808.7 828.0 878.3 885.1 895.7 9641.7 9856.2 9897.0 9900.8 9902.8 316761.0 321411.0 430513.0 433472.0 434045.0 83748.6 85432.6 85675.6 87539.0 87878.1 767.5 899.9 911.9 936.4 939.5 14687.3 15089.7 15688.5 16385.3 16752.4 37915.6 39151.4 39314.6 39429.0 39838.6 49839.8 51419.5 52374.5 52489.0 52768.2 6981.0 7270.8 7282.5 7284.1 7390.4 5918.7 9078.7 9114.6 9261.5 11276.5 9248.5 9305.8 9379.1 9451.8 9638.3 9382.5 9449.8 9859.7 9967.4 10151.8 9268.2 9652.9 9861.4 9861.8 10101.4 7254.3 7347.3 7389.7 7418.9 7442.9 8782.3 9193.4 9230.4 9288.3 9364.3 08:48:12 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | [#3] mootools.html Cycles:180 Average:5135.69 Median:4875.33 stddev:2902.67 (59.5%) stddev-sans-first:2896.97 08:48:12 INFO - PROCESS | 15729 | Values: 1362.7 1408.2 1475.5 1698.9 1714.2 7378.0 7859.0 7947.0 7957.0 7958.6 6776.8 7443.3 7695.3 7729.6 7740.5 2211.5 2229.6 2233.0 2233.9 2241.9 2215.1 2226.3 2245.3 2251.8 2256.0 1872.7 1950.4 2035.3 2038.8 2043.1 2167.7 2169.6 2190.9 2195.9 2205.7 2235.9 2255.1 2256.0 2259.9 2259.9 7683.9 7733.0 7734.8 7739.8 7740.5 4517.0 4662.1 4670.3 4671.1 4672.7 2830.9 2836.8 2978.0 2997.2 2998.9 919.0 938.5 941.7 954.2 964.3 10625.4 10748.2 10863.6 10877.8 10878.4 3990.3 4056.8 4194.1 4221.4 4233.2 9249.8 9299.0 9300.7 9303.2 9306.4 4522.1 4605.4 4655.2 4658.7 4660.6 4172.9 4203.0 4253.5 4254.6 4258.6 3499.0 3548.6 3556.8 3601.7 3602.5 1083.0 1108.8 1112.3 1120.8 1127.0 709.8 765.7 816.9 849.8 850.7 4951.0 5170.5 5211.7 5289.8 5375.2 422.3 435.3 438.8 450.0 589.2 3583.6 3641.2 3672.2 3675.5 3693.8 9588.1 9890.9 9968.1 10002.6 10016.9 8565.4 8860.0 9733.9 9829.2 9864.3 7079.4 7341.3 7352.7 7353.4 7357.5 5356.5 5416.6 5519.7 5574.4 5584.4 8759.6 8982.2 9043.2 9060.9 9063.3 8821.9 8872.9 8900.8 8998.6 9147.0 6625.2 6685.5 6695.2 6703.5 6758.7 7326.5 7458.8 7476.0 7489.2 7490.9 5183.5 6700.7 6779.2 6821.7 7077.7 6733.1 6846.5 6884.8 6885.0 6987.9 6107.5 6115.6 6169.6 6173.7 6174.3 4592.9 4646.4 4709.9 4734.5 4799.7 4675.4 4682.7 4688.5 4714.3 4768.9 08:48:12 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | [#4] prototype.html Cycles:180 Average:4220.92 Median:4774.23 stddev:1207.70 (25.3%) stddev-sans-first:1174.57 08:48:12 INFO - PROCESS | 15729 | Values: 293.7 301.9 305.3 306.6 311.4 4771.6 4779.5 4785.9 4824.4 4828.2 4501.0 4607.6 4631.4 4761.6 4776.8 3775.7 3797.0 3817.7 3823.3 3824.3 3802.6 3813.7 3827.0 3829.7 3841.6 3588.2 3647.9 3756.9 3768.1 3787.0 3758.7 3773.7 3775.1 3777.7 3783.9 3380.7 3387.5 3389.1 3392.8 3399.2 4449.2 4667.8 4686.4 4693.3 4697.2 4353.4 4377.2 4381.1 4384.6 4392.7 5045.8 5047.5 5056.7 5065.1 5066.6 3623.4 3726.5 3729.2 3730.0 3730.6 5218.8 5239.4 5244.9 5254.4 5272.8 3805.7 3812.5 3812.9 3828.4 3834.3 3875.2 3877.4 3883.6 3884.6 3885.8 4234.4 4346.0 4350.9 4353.9 4360.7 5015.8 5028.4 5041.0 5041.7 5056.4 1257.5 1283.7 1330.9 1343.4 1343.9 906.9 912.5 927.6 932.2 932.8 4415.4 4419.1 4439.3 4442.2 4452.1 5127.9 5130.8 5135.8 5138.7 5146.8 4423.5 4443.3 4446.2 4447.4 4447.7 2595.2 2744.2 2751.2 2751.7 2769.1 4912.7 4914.6 4922.4 4924.8 4929.9 5068.6 5288.6 5311.7 5337.8 5340.4 4939.8 4946.3 4947.0 4958.0 4962.7 5237.8 5242.8 5254.9 5258.7 5267.2 4918.8 5137.3 5154.1 5159.1 5177.0 4966.1 4976.3 4978.5 4987.3 4992.0 3734.3 3745.7 3748.6 3754.4 3764.9 5003.4 5172.9 5226.7 5280.7 5287.0 5061.8 5070.0 5082.1 5093.3 5111.2 5056.4 5059.6 5063.8 5073.4 5078.2 4717.8 4970.6 4971.8 4990.4 5001.3 5076.3 5111.3 5114.5 5117.1 5121.2 4996.2 5012.4 5016.5 5025.7 5031.4 08:48:12 INFO - PROCESS | 15729 | 08:48:12 INFO - PROCESS | 15729 | [#5] yui.html Cycles:180 Average:16833.88 Median:515.44 stddev:24188.54 (4692.8%) stddev-sans-first:24225.59 08:48:12 INFO - PROCESS | 15729 | Values: 575.7 601.8 601.9 655.5 682.5 11581.7 12433.0 12460.8 12506.1 12513.0 11076.8 12353.1 12353.7 12362.4 12363.9 625.1 769.1 770.5 779.4 787.5 784.9 786.5 791.0 791.1 791.7 830.9 832.6 832.9 832.9 833.2 659.1 668.2 671.5 678.2 829.6 587.4 604.0 604.8 604.8 605.3 11778.8 11784.4 11798.4 11812.8 11827.8 10782.2 11088.9 11513.2 12074.0 12173.4 11516.7 11533.4 11761.5 11768.1 11851.9 4125.9 4177.5 4217.2 4284.6 4301.4 61588.4 64730.0 64826.4 64891.0 65482.0 10008.5 10022.7 10121.4 10140.2 10141.3 16924.2 17054.9 17121.1 17158.5 17183.9 6456.4 6568.0 6667.8 6765.7 6830.8 3335.5 3539.9 3585.4 3600.4 3602.3 2675.1 2765.2 2765.7 2767.4 2768.2 491.6 492.0 493.1 508.9 510.2 454.9 491.1 512.5 526.1 527.6 7325.2 7536.2 7563.8 7848.9 7941.9 454.9 466.6 485.7 492.5 518.4 3851.7 3894.7 3903.3 4042.7 4093.1 54607.5 54699.2 79736.2 95888.5 97839.0 80751.6 81450.6 81715.0 82606.0 83479.2 73392.6 75886.2 76590.0 77885.2 78034.6 7418.7 7450.5 7523.2 7662.0 7729.3 39282.4 44922.8 45544.3 45990.0 46155.0 64760.4 65026.0 65427.0 65482.3 65697.7 9257.1 9387.7 9493.4 9511.6 9582.3 10868.7 10957.7 10984.2 11201.1 11529.6 10169.9 10242.3 10442.7 10490.6 10749.7 10203.7 10591.4 10657.9 10738.4 10777.4 9993.1 10052.5 10138.3 10159.9 10457.8 8210.9 8424.9 8488.7 8782.6 8828.8 7935.2 8015.3 8176.3 8290.2 8511.9 08:48:12 INFO - PROCESS | 15729 | -------- Summary: end -------- 08:48:12 INFO - PROCESS | 15729 | 08:48:13 INFO - TEST-INFO | 15729: exit 0 08:48:13 INFO - TEST-OK | dromaeo_css | took 1119851ms 08:48:13 INFO - TEST-START | kraken 08:48:13 INFO - operating with platform_type : linux_ 08:48:13 INFO - Initialising browser for kraken test... 08:48:13 INFO - TEST-INFO | started process 15921 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWFO2tQ/profile http://localhost:50827/getInfo.html) 08:48:18 INFO - PROCESS | 15921 | __metrics Screen width/height:1600/1200 08:48:18 INFO - PROCESS | 15921 | colorDepth:24 08:48:18 INFO - PROCESS | 15921 | Browser inner width/height: 1024/697 08:48:18 INFO - PROCESS | 15921 | __metrics 08:48:19 INFO - PROCESS | 15921 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:48:19 INFO - PROCESS | 15921 | console.error: PushService: 08:48:19 INFO - PROCESS | 15921 | stateChangeProcessEnqueue: Error transitioning state 08:48:19 INFO - PROCESS | 15921 | UnknownError 08:48:20 INFO - TEST-INFO | 15921: exit 0 08:48:20 INFO - Browser initialized. 08:48:20 INFO - Running cycle 1/1 for kraken test... 08:48:20 INFO - TEST-INFO | started process 16003 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWFO2tQ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:48:32 INFO - PROCESS | 16003 | RSS: Main: 159080448 08:48:32 INFO - PROCESS | 16003 | 08:48:34 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50827/tests/kraken/driver.html?testName=audio-beat-detection) 08:48:35 INFO - PROCESS | 16003 | RSS: Main: 216862720 08:48:35 INFO - PROCESS | 16003 | 08:48:38 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50827/tests/kraken/driver.html?testName=audio-dft) 08:48:39 INFO - PROCESS | 16003 | RSS: Main: 204378112 08:48:39 INFO - PROCESS | 16003 | 08:48:42 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50827/tests/kraken/driver.html?testName=audio-fft) 08:48:43 INFO - PROCESS | 16003 | RSS: Main: 270929920 08:48:43 INFO - PROCESS | 16003 | 08:48:45 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50827/tests/kraken/driver.html?testName=audio-oscillator) 08:48:45 INFO - PROCESS | 16003 | RSS: Main: 181448704 08:48:45 INFO - PROCESS | 16003 | 08:48:48 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50827/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:48:48 INFO - PROCESS | 16003 | RSS: Main: 185651200 08:48:48 INFO - PROCESS | 16003 | 08:48:51 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50827/tests/kraken/driver.html?testName=imaging-darkroom) 08:48:52 INFO - PROCESS | 16003 | RSS: Main: 221650944 08:48:52 INFO - PROCESS | 16003 | 08:48:55 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50827/tests/kraken/driver.html?testName=imaging-desaturate) 08:48:56 INFO - PROCESS | 16003 | RSS: Main: 221888512 08:48:56 INFO - PROCESS | 16003 | 08:48:59 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50827/tests/kraken/driver.html?testName=json-parse-financial) 08:49:00 INFO - PROCESS | 16003 | RSS: Main: 222609408 08:49:00 INFO - PROCESS | 16003 | 08:49:01 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50827/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:49:02 INFO - PROCESS | 16003 | RSS: Main: 210526208 08:49:02 INFO - PROCESS | 16003 | 08:49:04 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50827/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:49:04 INFO - PROCESS | 16003 | RSS: Main: 214859776 08:49:04 INFO - PROCESS | 16003 | 08:49:07 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50827/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:49:07 INFO - PROCESS | 16003 | RSS: Main: 211058688 08:49:07 INFO - PROCESS | 16003 | 08:49:10 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50827/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:49:11 INFO - PROCESS | 16003 | RSS: Main: 223600640 08:49:11 INFO - PROCESS | 16003 | 08:49:14 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50827/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:49:14 INFO - PROCESS | 16003 | RSS: Main: 225427456 08:49:14 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | Cycle 1(1): loaded http://localhost:50827/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50827/tests/kraken/driver.html?testName=ai-astar) 08:49:16 INFO - PROCESS | 16003 | RSS: Main: 267751424 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | __start_tp_report 08:49:16 INFO - PROCESS | 16003 | _x_x_mozilla_page_load 08:49:16 INFO - PROCESS | 16003 | _x_x_mozilla_page_load_details 08:49:16 INFO - PROCESS | 16003 | |i|pagename|runs| 08:49:16 INFO - PROCESS | 16003 | |0;ai-astar;106;115;114;114;116;113;114;113;113;114 08:49:16 INFO - PROCESS | 16003 | |1;audio-beat-detection;157;127;129;176;122;127;144;121;163;125 08:49:16 INFO - PROCESS | 16003 | |2;audio-dft;162;161;162;161;163;163;163;161;160;161 08:49:16 INFO - PROCESS | 16003 | |3;audio-fft;76;77;76;111;76;77;76;75;98;76 08:49:16 INFO - PROCESS | 16003 | |4;audio-oscillator;86;87;114;85;86;86;119;86;86;126 08:49:16 INFO - PROCESS | 16003 | |5;imaging-gaussian-blur;117;117;117;117;117;117;117;117;116;117 08:49:16 INFO - PROCESS | 16003 | |6;imaging-darkroom;146;146;148;146;146;145;145;146;146;146 08:49:16 INFO - PROCESS | 16003 | |7;imaging-desaturate;95;94;95;95;95;94;95;95;94;95 08:49:16 INFO - PROCESS | 16003 | |8;json-parse-financial;65;64;64;64;64;66;65;63;64;63 08:49:16 INFO - PROCESS | 16003 | |9;json-stringify-tinderbox;64;65;64;65;65;64;66;66;65;65 08:49:16 INFO - PROCESS | 16003 | |10;stanford-crypto-aes;78;83;78;79;79;80;84;79;80;78 08:49:16 INFO - PROCESS | 16003 | |11;stanford-crypto-ccm;139;128;139;128;148;130;132;132;206;131 08:49:16 INFO - PROCESS | 16003 | |12;stanford-crypto-pbkdf2;168;167;168;168;165;163;164;166;167;164 08:49:16 INFO - PROCESS | 16003 | |13;stanford-crypto-sha256-iterative;67;70;66;66;67;66;68;67;67;64 08:49:16 INFO - PROCESS | 16003 | __end_tp_report 08:49:16 INFO - PROCESS | 16003 | __start_cc_report 08:49:16 INFO - PROCESS | 16003 | _x_x_mozilla_cycle_collect,1957 08:49:16 INFO - PROCESS | 16003 | __end_cc_report 08:49:16 INFO - PROCESS | 16003 | __startTimestamp1467215356647__endTimestamp 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | ------- Summary: start ------- 08:49:16 INFO - PROCESS | 16003 | Number of tests: 14 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#0] ai-astar Cycles:10 Average:113.20 Median:114.00 stddev:2.70 (2.4%) stddev-sans-first:1.00 08:49:16 INFO - PROCESS | 16003 | Values: 106.0 115.0 114.0 114.0 116.0 113.0 114.0 113.0 113.0 114.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#1] audio-beat-detection Cycles:10 Average:139.10 Median:136.50 stddev:19.69 (14.4%) stddev-sans-first:19.80 08:49:16 INFO - PROCESS | 16003 | Values: 157.0 127.0 129.0 176.0 122.0 127.0 144.0 121.0 163.0 125.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#2] audio-dft Cycles:10 Average:161.70 Median:162.00 stddev:1.06 (0.7%) stddev-sans-first:1.12 08:49:16 INFO - PROCESS | 16003 | Values: 162.0 161.0 162.0 161.0 163.0 163.0 163.0 161.0 160.0 161.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#3] audio-fft Cycles:10 Average:81.80 Median:76.00 stddev:12.36 (16.3%) stddev-sans-first:12.93 08:49:16 INFO - PROCESS | 16003 | Values: 76.0 77.0 76.0 111.0 76.0 77.0 76.0 75.0 98.0 76.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#4] audio-oscillator Cycles:10 Average:96.10 Median:86.00 stddev:16.52 (19.2%) stddev-sans-first:17.11 08:49:16 INFO - PROCESS | 16003 | Values: 86.0 87.0 114.0 85.0 86.0 86.0 119.0 86.0 86.0 126.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 08:49:16 INFO - PROCESS | 16003 | Values: 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 116.0 117.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#6] imaging-darkroom Cycles:10 Average:146.00 Median:146.00 stddev:0.82 (0.6%) stddev-sans-first:0.87 08:49:16 INFO - PROCESS | 16003 | Values: 146.0 146.0 148.0 146.0 146.0 145.0 145.0 146.0 146.0 146.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#7] imaging-desaturate Cycles:10 Average:94.70 Median:95.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 08:49:16 INFO - PROCESS | 16003 | Values: 95.0 94.0 95.0 95.0 95.0 94.0 95.0 95.0 94.0 95.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#8] json-parse-financial Cycles:10 Average:64.20 Median:64.00 stddev:0.92 (1.4%) stddev-sans-first:0.93 08:49:16 INFO - PROCESS | 16003 | Values: 65.0 64.0 64.0 64.0 64.0 66.0 65.0 63.0 64.0 63.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#9] json-stringify-tinderbox Cycles:10 Average:64.90 Median:65.00 stddev:0.74 (1.1%) stddev-sans-first:0.71 08:49:16 INFO - PROCESS | 16003 | Values: 64.0 65.0 64.0 65.0 65.0 64.0 66.0 66.0 65.0 65.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#10] stanford-crypto-aes Cycles:10 Average:79.80 Median:79.50 stddev:2.10 (2.6%) stddev-sans-first:2.12 08:49:16 INFO - PROCESS | 16003 | Values: 78.0 83.0 78.0 79.0 79.0 80.0 84.0 79.0 80.0 78.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#11] stanford-crypto-ccm Cycles:10 Average:141.30 Median:135.50 stddev:23.58 (17.4%) stddev-sans-first:24.99 08:49:16 INFO - PROCESS | 16003 | Values: 139.0 128.0 139.0 128.0 148.0 130.0 132.0 132.0 206.0 131.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.00 Median:167.00 stddev:1.89 (1.1%) stddev-sans-first:1.86 08:49:16 INFO - PROCESS | 16003 | Values: 168.0 167.0 168.0 168.0 165.0 163.0 164.0 166.0 167.0 164.0 08:49:16 INFO - PROCESS | 16003 | 08:49:16 INFO - PROCESS | 16003 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.80 Median:67.00 stddev:1.55 (2.3%) stddev-sans-first:1.64 08:49:16 INFO - PROCESS | 16003 | Values: 67.0 70.0 66.0 66.0 67.0 66.0 68.0 67.0 67.0 64.0 08:49:16 INFO - PROCESS | 16003 | -------- Summary: end -------- 08:49:16 INFO - PROCESS | 16003 | 08:49:17 INFO - TEST-INFO | 16003: exit 0 08:49:17 INFO - TEST-OK | kraken | took 64118ms 08:49:17 INFO - SUITE-END | took 1183s 08:49:18 INFO - Completed test suite (00:19:44) 08:49:18 INFO - javascript benchmark 08:49:18 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2658.17596545071, 2670.6928703199137, 2709.0924540279007, 2714.0772137473255, 2714.5656694928816, 4706.529347065291, 4790.880227994302, 4804.447488538819, 4850.757462126889, 4892.804287828487, 4765.8808529786775, 4773.236282194849, 4778.52214778522, 4813.759312034402, 4822.9035419291595, 4308.590683885026, 4367.08291258836, 4397.626201772853, 4411.470623525165, 4583.954160458403, 4524.0, 4527.750973696446, 4547.636189104864, 4553.453585569736, 4602.769861506928, 4302.311630139163, 4337.761423121727, 4346.608805207515, 4381.496127945264, 4442.822287108512, 4396.274614688573, 4399.340098985146, 4407.691461597689, 4483.955160448387, 4486.304622783474, 4431.933520997188, 4432.20220360335, 4450.376947227391, 4472.664550158751, 4478.977605111986, 4668.953310466886, 4800.543948324904, 4815.205491093965, 4819.59033482151, 4859.295402166701, 5067.138586440314, 5073.695578265316, 5090.592752579785, 5117.7185254810975, 5196.142636464979, 5146.974265128688, 5164.870878228036, 5172.353455818023, 5206.97396513015, 5212.739363031871, 4754.667173297836, 4809.110314591811, 4814.662973591885, 4840.1287768201355, 4854.708717476963, 5325.201219817059, 5379.78480860769, 5386.59600529954, 5424.566034717213, 5439.3200849893765, 5149.6910185389, 5162.9741851291255, 5202.479752024768, 5212.661177023481, 5213.530782229542, 4963.851084467472, 5134.48655134491, 5180.715060671624, 5293.867653308698, 5303.204519322133, 5179.45615710345, 5183.352080989876, 5185.144451165591, 5207.062728708869, 5214.348206474191, 5135.050015747099, 5136.948630513647, 5156.664816786897, 5163.638545301868, 5199.740012999335, 4328.394024836525, 4368.759718215529, 4378.255696531597, 4401.383806267125, 4415.492218394926, 3769.26499332633, 3809.8476060957805, 3812.4853144825092, 3865.2849222893856, 3898.4542164097047, 4397.362382454527, 4398.516163222043, 4404.031113155101, 4442.622377097919, 4446.510883802779, 5052.267421223902, 5137.743112844343, 5138.743062846843, 5140.460251673595, 5187.04039752647, 4339.631131353807, 4365.214261432972, 4395.7362558246605, 4396.230659634615, 4407.581279778416, 4635.953640463552, 4636.976815115903, 4643.141018911445, 4644.58198762113, 4695.5304469552775, 4769.3084502746215, 4853.538913803183, 4861.808856830099, 4867.659263851497, 4909.337239472697, 5145.819896303611, 5188.533032027136, 5202.089634314056, 5207.114790485551, 5220.791168353223, 4889.926651100165, 4894.535019173173, 4897.0, 4904.239842824368, 4946.777395017161, 4939.0, 5047.747612619428, 5133.512316329943, 5134.281200631989, 5135.460776618551, 5122.436531981404, 5164.457731938092, 5179.482051794941, 5184.507471790174, 5236.476352364733, 4996.425411077773, 5005.099082165245, 5007.599392048554, 5008.899822003613, 5058.494150585059, 4878.512148785235, 4977.502249775139, 4992.301077849177, 5008.048470790538, 5013.974930125326, 4946.3817022872145, 4953.777080031479, 4983.0, 4984.1526940420945, 4988.6757360771435, 5076.82231121909, 5089.0, 5090.847274581768, 5091.134507133722, 5137.897242055213, 4859.3682821233015, 4867.464578896248, 4901.215805471107, 4906.950930490792, 4967.428745694291], "value": 4738.998684338064, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [581.8254523642906, 586.5014737473149, 590.1354515634595, 595.4938302442921, 600.3726106218998, 26828.86585567072, 40095.39856902149, 41438.58561414381, 41581.79209103958, 45543.0, 42092.15815683684, 42099.368509472384, 42157.578424215746, 42456.0, 42588.0, 7556.206598307181, 7638.618069096537, 7781.26078022587, 7789.260020298063, 7790.0, 7633.847323053536, 7743.419243556727, 7748.070231572191, 9855.605775768961, 10197.541110650038, 10132.442715650635, 10182.083612474877, 10195.592176312939, 10197.235207359441, 10202.591896324175, 9935.0, 10017.899821001842, 10019.44893030883, 10020.148287395506, 10020.298579099503, 7471.327580517725, 7717.459777815499, 7719.228077192292, 9582.28132890036, 10034.197264218918, 37845.0, 38064.61935380666, 38118.809405952794, 38150.61849381498, 38172.42741358882, 2999.8350090745002, 3086.2130156810094, 3131.3580715953403, 3161.225499752575, 3238.9028329150165, 28755.424891502054, 28858.567121493194, 29400.11799646014, 29439.558406623917, 29456.11631651054, 3151.2121969507625, 3358.5969683637877, 3358.7648864579487, 3407.6762707542744, 3440.8107554084513, 164072.0, 164660.0, 164792.0, 165262.0, 165680.0, 48342.27486587704, 54383.45616543784, 56095.15857262144, 56261.7186914071, 61628.691856540434, 57318.14022789661, 57596.712016440484, 57653.0, 57823.710881445324, 57876.421235787944, 14665.853341466449, 14740.41038358475, 14758.114513129247, 14768.040077394935, 14771.261436928111, 10987.450627468595, 11987.940060299643, 12080.395980200954, 12087.697807554881, 12167.148299619119, 17563.56091097733, 17989.460316190536, 18065.909670451565, 18277.3602923897, 18510.0, 6852.828679282959, 6961.338672826073, 6969.6515174241085, 6989.720411183495, 7064.551766887776, 759.4835511851994, 872.4983134697447, 905.1265528764642, 930.6230976454547, 958.5494817435793, 27748.0, 28329.29176770556, 28427.28931776722, 28518.287042824097, 28905.277368065545, 938.8122375524922, 967.2455484721787, 972.7470857577081, 1055.7466208110152, 1085.7448499602588, 14748.0, 15231.0, 15261.0, 15273.159976201194, 15480.767788483181, 392481.0, 397270.0, 397497.0, 397914.0, 398029.0, 50258.0, 50636.240456393185, 50686.746566266935, 50687.239691404655, 50699.23951140736, 1099.7745462180235, 1121.287982131336, 1179.6991767099335, 1220.664317312746, 1230.4831970572382, 25952.740472595033, 28572.285692857844, 28713.71286287194, 29257.561136582543, 29311.560326594692, 41304.58695413128, 41364.0, 41790.0, 41819.7909010453, 41843.7907810459, 295917.0, 297313.0, 298073.0, 298341.0, 301105.0, 22366.66450003284, 24437.38906527351, 24539.263822085366, 25371.112011080262, 25474.23577292684, 41652.37521437241, 41923.37114943339, 42297.22237484189, 42415.0, 42703.3594496089, 36178.4573231407, 36470.08824779402, 36538.8173059133, 37091.07272318214, 37370.43944340891, 36212.0, 36641.26717465689, 36657.63342366649, 36657.816710916275, 37272.44091338578, 34011.31977360488, 34129.31741365208, 34731.4790278141, 34939.82530087333, 35031.649683503856, 31844.52233216457, 32269.67730322667, 32297.35405291928, 32475.0, 32900.50649240216, 24901.87549062243, 25055.248342549752, 25274.74725252724, 25379.74620253774, 25552.105676301984], "value": 17755.56200880567, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [369.5749887629226, 375.5981100222762, 383.06914198497674, 392.65642562757586, 396.36383604315074, 16688.582785430353, 17201.65596688067, 17848.55378615532, 18113.728294075565, 18143.637127257447, 10889.945550272258, 10891.455427228626, 11039.227254092217, 11108.055815255713, 11153.776924461506, 4481.551844815509, 4621.560951709591, 5328.333958255218, 5362.034833729927, 5364.6781193128345, 5209.817656382027, 5299.947000529984, 5319.122344813101, 5339.439358867321, 5347.197920311945, 4666.113438446701, 4736.834210802623, 4755.619550435957, 4762.547557982003, 5316.601254905898, 4713.269443236304, 4715.7170569765585, 4722.244440889442, 4724.858254252378, 4738.502457241992, 4550.47669518003, 4576.084783043405, 4642.51253618372, 4654.045920586272, 4670.159371313162, 12126.0, 12131.757364852741, 12183.451744671422, 12195.45120469581, 12208.816867746991, 1894.886306821595, 1905.9047047647562, 1937.5834195648004, 2016.5865997470482, 2042.2443695832637, 9156.908430915671, 9213.401128926598, 9604.08761167688, 9664.130228279488, 9808.117269445713, 1714.1086634949756, 1781.2073627235886, 1785.8214178582168, 1786.178357955342, 1825.1695478557224, 72666.76313123996, 74201.6289918547, 75134.0, 75248.24751752522, 76754.61622691852, 10002.599896004078, 10166.542505587266, 10260.333078349884, 10296.124829389437, 10548.789024219474, 14162.079464834753, 14297.928510357382, 14305.78541321881, 14334.856651433562, 14358.712825743636, 7331.596762178131, 7394.852102957911, 7467.327940485274, 7524.9247507525315, 7569.0, 6963.721451141898, 7109.253528379549, 7145.243382396356, 7252.057232559733, 7306.159791624032, 4396.340548917688, 4456.821727130879, 4458.888527786767, 4485.372047913294, 4615.353850460938, 1733.3673209278522, 1785.6339450412634, 1837.0148508673406, 1874.3158747057225, 1919.1555715485142, 805.2269820971816, 886.8492356299445, 895.892492900856, 919.1957037592107, 967.3325405470204, 16751.413700520425, 16825.0, 17522.21150048251, 17646.823531764774, 17755.11224438773, 808.6644042722322, 827.9503229806231, 878.310526236901, 885.0574138542431, 895.6820328783318, 9641.710748677551, 9856.162226210708, 9896.950515247521, 9900.752481188028, 9902.80194396108, 316761.0, 321411.0, 430513.0, 433472.0, 434045.0, 83748.58125709454, 85432.57283713542, 85675.57162214149, 87539.0, 87878.12121878828, 767.4857845243589, 899.9460032398077, 911.8951320598084, 936.3866667332908, 939.455116032713, 14687.339069741674, 15089.698206036037, 15688.529344119695, 16385.344586216896, 16752.413665522137, 37915.62084379121, 39151.41272880966, 39314.606853931095, 39429.0, 39838.60161398465, 49839.75080124576, 51419.48580514147, 52374.476255238485, 52489.0, 52768.208476873646, 6980.965095174492, 7270.818229544304, 7282.453815963718, 7284.053073100463, 7390.445716571171, 5918.704064796829, 9078.682246121354, 9114.589843456928, 9261.53692315395, 11276.548938042715, 9248.537573121183, 9305.767355816159, 9379.10898464672, 9451.810963780548, 9638.277129215478, 9382.530873456164, 9449.811003779749, 9859.654912078044, 9967.40195588267, 10151.79696406053, 9268.165865071906, 9652.855207172039, 9861.408315501092, 9861.802763944537, 10101.393916365041, 7254.347108760026, 7347.33873951347, 7389.667464964197, 7418.925810741824, 7442.9255707442235, 8782.253508451853, 9193.402428842104, 9230.446173229628, 9288.256939444964, 9364.250859931326], "value": 7890.294084507586, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1362.6865820861199, 1408.162143524603, 1475.461456568352, 1698.8895721778076, 1714.2457318779727, 7378.0, 7859.0, 7947.0, 7956.960215198923, 7958.562279074648, 6776.796696099125, 7443.255674432554, 7695.345895598867, 7729.61351932404, 7740.535567865932, 2211.5355775287167, 2229.576380487702, 2233.0174723121772, 2233.8771367574777, 2241.8991145398413, 2215.125025614881, 2226.309843948373, 2245.2815099168274, 2251.7748225177434, 2255.977440225601, 1872.681644120496, 1950.4051264364364, 2035.2571311471354, 2038.7655419626785, 2043.0806137238228, 2167.674848772681, 2169.620316444616, 2190.912363505458, 2195.890205489727, 2205.6691496275525, 2235.8770267635437, 2255.064148378421, 2255.977440225593, 2259.8757068361233, 2259.8757068361233, 7683.923160768377, 7732.961335193288, 7734.806629834243, 7739.806504837367, 7740.53556786589, 4517.0, 4662.090892276007, 4670.276107203389, 4671.089137618166, 4672.696274742131, 2830.915072547806, 2836.801423900328, 2977.955330670042, 2997.220722612115, 2998.880044798227, 919.0, 938.5072836760687, 941.6562954521619, 954.19370631816, 964.262339310428, 10625.362478251329, 10748.193885458544, 10863.619773307975, 10877.782444351069, 10878.401687907162, 3990.3415936370175, 4056.817443215062, 4194.119234960632, 4221.430106935524, 4233.174530966494, 9249.768755781159, 9299.0, 9300.72097837066, 9303.209227215762, 9306.441613503212, 4522.050369422393, 4605.424321959755, 4655.185342565038, 4658.720476771405, 4660.627149828006, 4172.853950111731, 4202.957970420318, 4253.490011046096, 4254.574542545721, 4258.61672449481, 3499.0, 3548.591911930161, 3556.7865928043884, 3601.6758491735345, 3602.5136606558303, 1082.9891701082888, 1108.7560736637927, 1112.2770199370311, 1120.7758448310371, 1127.0363838917608, 709.794159693683, 765.7052034966578, 816.8978877640295, 849.7705619482705, 850.6767428377301, 4950.975245123751, 5170.45710200431, 5211.713355765393, 5289.841304760864, 5375.247465354853, 422.343256236549, 435.3100335967464, 438.8135042606943, 449.97075190112537, 589.2163422647868, 3583.552055993001, 3641.1625326175126, 3672.155404257036, 3675.5405574303213, 3693.759905606127, 9588.089131532633, 9890.851637225447, 9968.053034961667, 10002.599896004223, 10016.949915250523, 8565.357598180162, 8859.955700221457, 9733.902660973441, 9829.164521015651, 9864.260180486348, 7079.39825114871, 7341.302576255247, 7352.669129889167, 7353.411727061823, 7357.484976051625, 5356.491133342326, 5416.647917885325, 5519.668819870821, 5574.386817449996, 5584.357798853184, 8759.562021898751, 8982.236509896731, 9043.18611324984, 9060.909390906007, 9063.274938005075, 8821.867671984797, 8872.911270887209, 8900.77748056278, 8998.550072496218, 9147.0, 6625.238097618835, 6685.498587606046, 6695.230048544285, 6703.463722902058, 6758.662066896733, 7326.487145899736, 7458.813529661802, 7476.0, 7489.176190619137, 7490.850182996201, 5183.533481986639, 6700.698468569024, 6779.186497620317, 6821.727130914708, 7077.716891324495, 6733.091032710521, 6846.486513511407, 6884.759033433806, 6884.967254911803, 6987.930120698931, 6107.450329470369, 6115.571909966259, 6169.598976066542, 6173.660448675366, 6174.320824709189, 4592.931106033346, 4646.4191976003, 4709.929351059805, 4734.502877197982, 4799.688020278671, 4675.368825208553, 4682.742449165193, 4688.531146885284, 4714.292856071616, 4768.928466072943], "value": 4071.7249727378053, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [293.7048266492175, 301.9199912023314, 305.33132439956495, 306.5723315974216, 311.377245508982, 4771.618270538353, 4779.474257831635, 4785.880352991177, 4824.445188803289, 4828.203346447836, 4500.997056309935, 4607.608353289966, 4631.421072365954, 4761.619070474362, 4776.832810851621, 3775.6790672792845, 3797.0, 3817.6945844332386, 3823.2735780201674, 3824.3116239076885, 3802.5817160112365, 3813.7139714521522, 3826.961730382702, 3829.6936245100324, 3841.5966323536045, 3588.156783155969, 3647.908802279938, 3756.9436458453147, 3768.1144930941205, 3786.9775160706595, 3758.68051215647, 3773.716971227169, 3775.093977445407, 3777.678897293747, 3783.921582349017, 3380.695737383647, 3387.4580067189377, 3389.1188291044505, 3392.8133952632597, 3399.1841957930164, 4449.17690227309, 4667.766611669403, 4686.367340409035, 4693.272542755878, 4697.154512187805, 4353.390525326457, 4377.183468860451, 4381.130359614458, 4384.56154384559, 4392.692511524195, 5045.772940217699, 5047.520485553867, 5056.747162641853, 5065.138926382524, 5066.594672426234, 3623.3840247158046, 3726.496922915399, 3729.160938788778, 3729.981350093259, 3730.552333719944, 5218.817341393071, 5239.449857764956, 5244.921326180111, 5254.369475662945, 5272.789088436458, 3805.7145714071557, 3812.5043744313616, 3812.8856134316015, 3828.3874580067054, 3834.271488417192, 3875.1592993327945, 3877.43777152317, 3883.611638836094, 3884.6309600587897, 3885.786281754474, 4234.3860140279485, 4345.97827010863, 4350.868774118752, 4353.934690979638, 4360.694751367438, 5015.799368025311, 5028.446870844205, 5041.0, 5041.6722913010535, 5056.395956082621, 1257.4844313831286, 1283.6521652265085, 1330.8735670111519, 1343.3753304713355, 1343.9462421503226, 906.8685040669066, 912.5209265135857, 927.5854322158627, 932.2262522106636, 932.8087742012871, 4415.448068991376, 4419.11617676466, 4439.311906654474, 4442.244818380883, 4452.063352441698, 5127.897442051138, 5130.769115389817, 5135.820246291362, 5138.717370544656, 5146.761158895893, 4423.535528769497, 4443.289073748249, 4446.221911165533, 4447.355133505624, 4447.710898791568, 2595.2214335699214, 2744.217897899089, 2751.2021513760783, 2751.7385848344375, 2769.141566114511, 4912.680675756064, 4914.631402644816, 4922.433920099163, 4924.8276310328965, 4929.866130789938, 5068.6451948363265, 5288.603354748409, 5311.7078560678765, 5337.786488540415, 5340.359156901197, 4939.753012349368, 4946.282788995575, 4946.975265123651, 4957.975210123926, 4962.727050012284, 5237.790488380422, 5242.7902883885745, 5254.868628284324, 5258.684478931276, 5267.183586544092, 4918.754062296943, 5137.280780690781, 5154.14956532183, 5159.09715799741, 5176.9741151294, 4966.106100901728, 4976.278439626306, 4978.477259887804, 4987.251912213052, 4992.0, 3734.3464893644045, 3745.7190710696264, 3748.55017397914, 3754.3992961126087, 3764.9058773529787, 5003.4246061701915, 5172.922406163986, 5226.719453733859, 5280.735963201748, 5287.0, 5061.848144555669, 5070.036693028313, 5082.085224659449, 5093.261477085876, 5111.182210846247, 5056.443791182894, 5059.6458247923765, 5063.8480845574695, 5073.441921388718, 5078.238264260242, 4717.834875779331, 4970.577500912318, 4971.776270067783, 4990.351254336913, 5001.299818025552, 5076.2740668173, 5111.335526381696, 5114.491225088682, 5117.130087884994, 5121.1550094234035, 4996.15065438869, 5012.373453318335, 5016.473270306566, 5025.673331233458, 5031.421386540448], "value": 3841.3035760346384, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [575.7265298982984, 601.7502736364409, 601.9067044608088, 655.5411212151494, 682.5358756045887, 11581.65255042349, 12433.0, 12460.81308780369, 12506.124571280003, 12513.0, 11076.833847492295, 12353.135280530367, 12353.691157721061, 12362.381880905963, 12363.876361236407, 625.109219362409, 769.1308821032226, 770.5415277909635, 779.3531368963746, 787.4920676163871, 784.8979632647777, 786.5202226641744, 791.0, 791.1376599506536, 791.651673263765, 830.9418340716152, 832.6003518311214, 832.8875601793741, 832.8958880139983, 833.2334252487726, 659.0608383054129, 668.2415458454641, 671.4863129705778, 678.1794029224644, 829.5727700234385, 587.4272584230341, 603.9849003774897, 604.7520516588178, 604.7520516588178, 605.3492495567283, 11778.823317650242, 11784.410779461079, 11798.41007949599, 11812.763744725144, 11827.822582661267, 10782.191335649779, 11088.889111108867, 11513.194076414655, 12074.0, 12173.391330433444, 11516.654500365003, 11533.423328833525, 11761.470733816914, 11768.117391195608, 11851.881481185164, 4125.855595054189, 4177.540470548237, 4217.198732240895, 4284.5715428457215, 4301.354796780508, 61588.38411615871, 64730.029049564764, 64826.351736482975, 64891.0, 65482.0, 10008.499575021366, 10022.699319020441, 10121.392716437038, 10140.239482038876, 10141.340812847142, 16924.238409271613, 17054.914725426293, 17121.14394280306, 17158.48524544266, 17183.914080429768, 6456.386643268882, 6567.9671601641685, 6667.799966001027, 6765.695543700545, 6830.795076147723, 3335.499675048762, 3539.911502212465, 3585.408407612767, 3600.369935261371, 3602.297551977392, 2675.050357123232, 2765.1704488653727, 2765.6542932133484, 2767.4326763013532, 2768.1972228053637, 491.5551425959512, 491.9852404427873, 493.10009233149646, 508.86006348253784, 510.2346480279581, 454.8771831605514, 491.130698663371, 512.4977522028433, 526.1003683700915, 527.5990247411994, 7325.194228634846, 7536.24637536242, 7563.810904727426, 7848.882266766003, 7941.880871786928, 454.87263566201517, 466.59173223429497, 485.74983883300126, 492.46567474290794, 518.3831240823483, 3851.651921827394, 3894.668953139015, 3903.2974064668065, 4042.7372220805555, 4093.099518106012, 54607.45392546103, 54699.179512307346, 79736.20263797404, 95888.52055739677, 97839.0, 80751.59624201841, 81450.59274703589, 81715.0, 82606.0, 83479.16520834835, 73392.63303683554, 75886.24113758902, 76590.0, 77885.2211477878, 78034.6098269505, 7418.703251870081, 7450.478466507509, 7523.172451030492, 7662.017884023195, 7729.304362607392, 39282.410763837994, 44922.77538612286, 45544.316835246835, 45990.0, 46155.0, 64760.352396475435, 65026.0, 65427.0, 65482.34517654763, 65697.67151164214, 9257.094166138248, 9387.671431499864, 9493.382930109521, 9511.619535218513, 9582.28132890022, 10868.67393978182, 10957.726056848642, 10984.231103822656, 11201.103911687209, 11529.596464123715, 10169.89830101719, 10242.283040187413, 10442.68671939843, 10490.632827850988, 10749.731256718645, 10203.693889183336, 10591.364518128628, 10657.89342106569, 10738.409387483764, 10777.407242601732, 9993.10062094415, 10052.497375131361, 10138.341007834468, 10159.949200254247, 10457.790844183226, 8210.876836847572, 8424.915750842412, 8488.74533763988, 8782.604782784918, 8828.823423531621, 7935.2064793520185, 8015.278624923785, 8176.345892328481, 8290.170982901662, 8511.914880851113], "value": 6178.139232060749, "unit": "score"}], "name": "dromaeo_css", "value": 6327.221597711702, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 115.0, 114.0, 114.0, 116.0, 113.0, 114.0, 113.0, 113.0, 114.0], "value": 113.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 127.0, 129.0, 176.0, 122.0, 127.0, 144.0, 121.0, 163.0, 125.0], "value": 139.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 161.0, 162.0, 161.0, 163.0, 163.0, 163.0, 161.0, 160.0, 161.0], "value": 161.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 76.0, 111.0, 76.0, 77.0, 76.0, 75.0, 98.0, 76.0], "value": 81.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 87.0, 114.0, 85.0, 86.0, 86.0, 119.0, 86.0, 86.0, 126.0], "value": 96.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 116.0, 117.0], "value": 116.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 148.0, 146.0, 146.0, 145.0, 145.0, 146.0, 146.0, 146.0], "value": 146.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 94.0, 95.0, 95.0, 95.0, 94.0, 95.0, 95.0, 94.0, 95.0], "value": 94.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 64.0, 64.0, 64.0, 66.0, 65.0, 63.0, 64.0, 63.0], "value": 64.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 65.0, 64.0, 65.0, 65.0, 64.0, 66.0, 66.0, 65.0, 65.0], "value": 64.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 83.0, 78.0, 79.0, 79.0, 80.0, 84.0, 79.0, 80.0, 78.0], "value": 79.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 128.0, 139.0, 128.0, 148.0, 130.0, 132.0, 132.0, 206.0, 131.0], "value": 141.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [168.0, 167.0, 168.0, 168.0, 165.0, 163.0, 164.0, 166.0, 167.0, 164.0], "value": 166.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 70.0, 66.0, 66.0, 67.0, 66.0, 68.0, 67.0, 67.0, 64.0], "value": 66.8, "unit": "score"}], "name": "kraken", "value": 1532.5, "alertThreshold": 2.0}]} 08:49:18 INFO - Return code: 0 08:49:18 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:49:18 INFO - # TBPL SUCCESS # 08:49:18 INFO - Running post-action listener: _resource_record_post_action 08:49:18 INFO - ##### 08:49:18 INFO - ##### Finished run-tests step (success) 08:49:18 INFO - ##### 08:49:18 INFO - Running post-run listener: _resource_record_post_run 08:49:18 INFO - Total resource usage - Wall time: 1201s; CPU: 13.0%; Read bytes: 4096; Write bytes: 554893312; Read time: 12; Write time: 667920 08:49:18 INFO - TinderboxPrint: CPU usage
13.0% 08:49:18 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 08:49:18 INFO - TinderboxPrint: I/O write bytes / time
554,893,312 / 667,920 08:49:18 INFO - TinderboxPrint: CPU idle
8,340.1 (87.0%) 08:49:18 INFO - TinderboxPrint: CPU user
1,200.3 (12.5%) 08:49:18 INFO - TinderboxPrint: Swap in / out
0 / 0 08:49:18 INFO - install - Wall time: 17s; CPU: 15.0%; Read bytes: 0; Write bytes: 257302528; Read time: 0; Write time: 359540 08:49:18 INFO - run-tests - Wall time: 1185s; CPU: 13.0%; Read bytes: 0; Write bytes: 297164800; Read time: 0; Write time: 308300 08:49:19 INFO - Running post-run listener: _upload_blobber_files 08:49:19 INFO - Blob upload gear active. 08:49:19 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:49:19 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 08:49:19 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-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:49:19 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-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:49:19 INFO - (blobuploader) - INFO - Open directory for files ... 08:49:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:49:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:49:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:49:25 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:49:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:49:25 INFO - (blobuploader) - INFO - Done attempting. 08:49:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:49:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:49:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:49:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:49:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:49:25 INFO - (blobuploader) - INFO - Done attempting. 08:49:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:49:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:49:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:49:26 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:49:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:49:26 INFO - (blobuploader) - INFO - Done attempting. 08:49:26 INFO - (blobuploader) - INFO - Iteration through files over. 08:49:26 INFO - Return code: 0 08:49:26 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:49:26 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:49:26 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6f9a0fd1e766dc7e3d22df8e20305536b2e85ecb50f3748c70be0ccc922744bc37679ec646ce5f81bd93426f09f1e702a8aefd0df086270e6027da106411e345", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c3573d454c837bc7a69a45922e7417583a95dd5fe4a6d7aa20d288138f35b933bb1425132731776443946202e4c50e491edb761c5866bfc9567dfc45162ba4a1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b67f274aca8ecf1c16347acc744f7635716ee29d79d0f37f86e5919f1b85a81b425b38c102c68aea392ceb73c244af0b4a7c4613082fdb9fc0d6699cba787247"} 08:49:26 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:49:26 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:49:26 INFO - Contents: 08:49:26 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6f9a0fd1e766dc7e3d22df8e20305536b2e85ecb50f3748c70be0ccc922744bc37679ec646ce5f81bd93426f09f1e702a8aefd0df086270e6027da106411e345", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c3573d454c837bc7a69a45922e7417583a95dd5fe4a6d7aa20d288138f35b933bb1425132731776443946202e4c50e491edb761c5866bfc9567dfc45162ba4a1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b67f274aca8ecf1c16347acc744f7635716ee29d79d0f37f86e5919f1b85a81b425b38c102c68aea392ceb73c244af0b4a7c4613082fdb9fc0d6699cba787247"} 08:49:26 INFO - Running post-run listener: copy_logs_to_upload_dir 08:49:26 INFO - Copying logs to upload dir... 08:49:26 INFO - mkdir: /builds/slave/test/build/upload/logs 08:49:26 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.919455 ========= master_lag: 0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-06-29 08:49:25.213406) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-29 08:49:25.216958) ========= 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=fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619 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-Non-PGO/sha512/6f9a0fd1e766dc7e3d22df8e20305536b2e85ecb50f3748c70be0ccc922744bc37679ec646ce5f81bd93426f09f1e702a8aefd0df086270e6027da106411e345", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c3573d454c837bc7a69a45922e7417583a95dd5fe4a6d7aa20d288138f35b933bb1425132731776443946202e4c50e491edb761c5866bfc9567dfc45162ba4a1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b67f274aca8ecf1c16347acc744f7635716ee29d79d0f37f86e5919f1b85a81b425b38c102c68aea392ceb73c244af0b4a7c4613082fdb9fc0d6699cba787247"} build_url:https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011203 build_url: 'https://queue.taskcluster.net/v1/task/f0O4T6PHQdeaTgOOfixZwg/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-Non-PGO/sha512/6f9a0fd1e766dc7e3d22df8e20305536b2e85ecb50f3748c70be0ccc922744bc37679ec646ce5f81bd93426f09f1e702a8aefd0df086270e6027da106411e345", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c3573d454c837bc7a69a45922e7417583a95dd5fe4a6d7aa20d288138f35b933bb1425132731776443946202e4c50e491edb761c5866bfc9567dfc45162ba4a1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b67f274aca8ecf1c16347acc744f7635716ee29d79d0f37f86e5919f1b85a81b425b38c102c68aea392ceb73c244af0b4a7c4613082fdb9fc0d6699cba787247"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-29 08:49:25.242533) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 08:49:25.242874) ========= 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=fa44defc139c4ba8574fe040000001db-1467214122.250817-740215619 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004440 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-29 08:49:25.329467) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-29 08:49:25.329807) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-29 08:49:25.330138) ========= ========= Total master_lag: 0.16 =========