builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-056 starttime: 1467982160.57 results: success (0) buildid: 20160708023010 builduid: 951ccdffcfe945dbaac7aee7cbc09f20 revision: 806cd7a7b68de8777caf419239e2f4e671aaa80b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.571790) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.572255) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.572545) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.587120) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.587481) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-08 05:49:21-- 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% 60.9M=0s 2016-07-08 05:49:21 (60.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.070994 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.672727) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.673125) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019957 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.736567) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:20.736915) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 806cd7a7b68de8777caf419239e2f4e671aaa80b --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 806cd7a7b68de8777caf419239e2f4e671aaa80b --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-08 05:49:22,051 truncating revision to first 12 chars 2016-07-08 05:49:22,051 Setting DEBUG logging. 2016-07-08 05:49:22,051 attempt 1/10 2016-07-08 05:49:22,051 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/806cd7a7b68d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-08 05:49:22,403 unpacking tar archive at: fx-team-806cd7a7b68d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.723402 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:21.474620) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:21.474966) ========= script_repo_revision: 806cd7a7b68de8777caf419239e2f4e671aaa80b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:21.475420) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:21.475751) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-08 05:49:21.486243) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-07-08 05:49:21.486676) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:49:22 INFO - MultiFileLogger online at 20160708 05:49:22 in /builds/slave/test 05:49:22 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 05:49:22 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:49:22 INFO - {'append_to_log': False, 05:49:22 INFO - 'base_work_dir': '/builds/slave/test', 05:49:22 INFO - 'blob_upload_branch': 'Fx-Team', 05:49:22 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:49:22 INFO - 'branch': 'Fx-Team', 05:49:22 INFO - 'buildbot_json_path': 'buildprops.json', 05:49:22 INFO - 'config_files': ('talos/linux_config.py',), 05:49:22 INFO - 'default_actions': ('clobber', 05:49:22 INFO - 'read-buildbot-config', 05:49:22 INFO - 'download-and-extract', 05:49:22 INFO - 'populate-webroot', 05:49:22 INFO - 'create-virtualenv', 05:49:22 INFO - 'install', 05:49:22 INFO - 'run-tests'), 05:49:22 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:49:22 INFO - 'download_minidump_stackwalk': True, 05:49:22 INFO - 'download_symbols': 'ondemand', 05:49:22 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:49:22 INFO - 'tooltool.py': '/tools/tooltool.py', 05:49:22 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:49:22 INFO - '/tools/misc-python/virtualenv.py')}, 05:49:22 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:49:22 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:49:22 INFO - 'installer_path': 'installer.exe', 05:49:22 INFO - 'log_level': 'info', 05:49:22 INFO - 'log_name': 'talos', 05:49:22 INFO - 'log_to_console': True, 05:49:22 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:49:22 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:49:22 INFO - 'opt_config_files': (), 05:49:22 INFO - 'pip_index': False, 05:49:22 INFO - 'sps_profile': False, 05:49:22 INFO - 'sps_profile_interval': 0, 05:49:22 INFO - 'suite': 'dromaeojs-e10s', 05:49:22 INFO - 'system_bits': '32', 05:49:22 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:49:22 INFO - 'title': 'talos-linux64-ix-056', 05:49:22 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:49:22 INFO - 'use_talos_json': True, 05:49:22 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:49:22 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:49:22 INFO - 'work_dir': 'build'} 05:49:22 INFO - ##### 05:49:22 INFO - ##### Running clobber step. 05:49:22 INFO - ##### 05:49:22 INFO - Running pre-action listener: _resource_record_pre_action 05:49:22 INFO - Running main action method: clobber 05:49:22 INFO - rmtree: /builds/slave/test/build 05:49:22 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:49:23 INFO - Running post-action listener: _resource_record_post_action 05:49:23 INFO - ##### 05:49:23 INFO - ##### Finished clobber step (success) 05:49:23 INFO - ##### 05:49:23 INFO - ##### 05:49:23 INFO - ##### Running read-buildbot-config step. 05:49:23 INFO - ##### 05:49:23 INFO - Running pre-action listener: _resource_record_pre_action 05:49:23 INFO - Running main action method: read_buildbot_config 05:49:23 INFO - Using buildbot properties: 05:49:23 INFO - { 05:49:23 INFO - "project": "", 05:49:23 INFO - "product": "firefox", 05:49:23 INFO - "script_repo_revision": "production", 05:49:23 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 05:49:23 INFO - "repository": "", 05:49:23 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 05:49:23 INFO - "buildid": "20160708023010", 05:49:23 INFO - "pgo_build": "True", 05:49:23 INFO - "basedir": "/builds/slave/test", 05:49:23 INFO - "buildnumber": 551, 05:49:23 INFO - "slavename": "talos-linux64-ix-056", 05:49:23 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 05:49:23 INFO - "platform": "ubuntu64_hw", 05:49:23 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 05:49:23 INFO - "branch": "fx-team", 05:49:23 INFO - "repo_path": "integration/fx-team", 05:49:23 INFO - "revision": "806cd7a7b68de8777caf419239e2f4e671aaa80b", 05:49:23 INFO - "stage_platform": "linux64-pgo", 05:49:23 INFO - "builduid": "951ccdffcfe945dbaac7aee7cbc09f20", 05:49:23 INFO - "slavebuilddir": "test" 05:49:23 INFO - } 05:49:23 INFO - Found installer url https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 05:49:23 INFO - Running post-action listener: _resource_record_post_action 05:49:23 INFO - ##### 05:49:23 INFO - ##### Finished read-buildbot-config step (success) 05:49:23 INFO - ##### 05:49:23 INFO - ##### 05:49:23 INFO - ##### Running download-and-extract step. 05:49:23 INFO - ##### 05:49:23 INFO - Running pre-action listener: _resource_record_pre_action 05:49:23 INFO - Running main action method: download_and_extract 05:49:23 INFO - mkdir: /builds/slave/test/build/tests 05:49:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:49:23 INFO - https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 05:49:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 05:49:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 05:49:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:24 INFO - Downloaded 1361 bytes. 05:49:24 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 05:49:24 INFO - Using the following test package requirements: 05:49:24 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 05:49:24 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:49:24 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:49:24 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:24 INFO - u'jsshell-linux-x86_64.zip'], 05:49:24 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:49:24 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 05:49:24 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:49:24 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:49:24 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:49:24 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 05:49:24 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:49:24 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:49:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:24 INFO - https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:49:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 05:49:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 05:49:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:25 INFO - Downloaded 24304672 bytes. 05:49:25 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'] 05:49:25 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 05:49:27 INFO - Return code: 0 05:49:27 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 05:49:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:27 INFO - https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:49:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 05:49:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 05:49:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:28 INFO - Downloaded 24304672 bytes. 05:49:28 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'] 05:49:28 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 05:49:29 INFO - Return code: 0 05:49:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:49:29 INFO - https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:49:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 05:49:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 05:49:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:30 INFO - Downloaded 14403333 bytes. 05:49:30 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'] 05:49:30 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 05:49:30 INFO - Return code: 0 05:49:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:30 INFO - https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:49:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 05:49:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 05:49:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WZYUvIaIQ4mF3GQJABPKng/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 05:49:32 INFO - Downloaded 60450888 bytes. 05:49:32 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 05:49:32 INFO - mkdir: /builds/slave/test/properties 05:49:32 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:49:32 INFO - Writing to file /builds/slave/test/properties/build_url 05:49:32 INFO - Contents: 05:49:32 INFO - build_url:https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 05:49:34 INFO - Running post-action listener: _resource_record_post_action 05:49:34 INFO - Running post-action listener: set_extra_try_arguments 05:49:34 INFO - ##### 05:49:34 INFO - ##### Finished download-and-extract step (success) 05:49:34 INFO - ##### 05:49:34 INFO - ##### 05:49:34 INFO - ##### Running populate-webroot step. 05:49:34 INFO - ##### 05:49:34 INFO - Running pre-action listener: _resource_record_pre_action 05:49:34 INFO - Running main action method: populate_webroot 05:49:34 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:49:34 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:49:34 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:49:34 INFO - '--tppagecycles', 05:49:34 INFO - '7'], 05:49:34 INFO - 'tests': ['tsvgm']}}, 05:49:34 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:49:34 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:49:34 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:49:34 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:49:34 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:34 INFO - 'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:49:34 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:34 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:49:34 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:34 INFO - 'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['damp', 'tps']}, 05:49:34 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:34 INFO - 'tests': ['damp', 'tps']}, 05:49:34 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['dromaeo_dom']}, 05:49:34 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:49:34 INFO - 'g4': {'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['basic_compositor_video']}, 05:49:34 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 05:49:34 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['a11yr', 05:49:34 INFO - 'ts_paint', 05:49:34 INFO - 'tpaint', 05:49:34 INFO - 'sessionrestore', 05:49:34 INFO - 'sessionrestore_no_auto_restore', 05:49:34 INFO - 'tabpaint']}, 05:49:34 INFO - 'other-e10s': {'tests': ['a11yr', 05:49:34 INFO - 'ts_paint', 05:49:34 INFO - 'tpaint', 05:49:34 INFO - 'sessionrestore', 05:49:34 INFO - 'sessionrestore_no_auto_restore', 05:49:34 INFO - 'tabpaint']}, 05:49:34 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:49:34 INFO - 'ts_paint', 05:49:34 INFO - 'tpaint', 05:49:34 INFO - 'sessionrestore', 05:49:34 INFO - 'sessionrestore_no_auto_restore', 05:49:34 INFO - 'tabpaint']}, 05:49:34 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:49:34 INFO - 'ts_paint', 05:49:34 INFO - 'tpaint', 05:49:34 INFO - 'sessionrestore', 05:49:34 INFO - 'sessionrestore_no_auto_restore', 05:49:34 INFO - 'tabpaint']}, 05:49:34 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['a11yr', 05:49:34 INFO - 'ts_paint', 05:49:34 INFO - 'tpaint', 05:49:34 INFO - 'sessionrestore', 05:49:34 INFO - 'sessionrestore_no_auto_restore', 05:49:34 INFO - 'tabpaint']}, 05:49:34 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['a11yr', 05:49:34 INFO - 'ts_paint', 05:49:34 INFO - 'tpaint', 05:49:34 INFO - 'sessionrestore', 05:49:34 INFO - 'sessionrestore_no_auto_restore', 05:49:34 INFO - 'tabpaint']}, 05:49:34 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['tsvgx', 05:49:34 INFO - 'tsvgr_opacity', 05:49:34 INFO - 'tart', 05:49:34 INFO - 'tscrollx', 05:49:34 INFO - 'cart']}, 05:49:34 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:49:34 INFO - 'tsvgr_opacity', 05:49:34 INFO - 'tart', 05:49:34 INFO - 'tscrollx', 05:49:34 INFO - 'cart']}, 05:49:34 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:34 INFO - 'talos_options': ['--disable-e10s'], 05:49:34 INFO - 'tests': ['tp5o']}, 05:49:34 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:34 INFO - 'tests': ['tp5o']}, 05:49:34 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:34 INFO - 'talos_options': ['--disable-e10s', 05:49:34 INFO - '--xperf_path', 05:49:34 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:49:34 INFO - 'tests': ['tp5n']}, 05:49:34 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:49:34 INFO - 'talos_options': ['--xperf_path', 05:49:34 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:49:34 INFO - 'tests': ['tp5n']}}, 05:49:34 INFO - 'talos.zip': {'path': '', 05:49:34 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:49:34 INFO - Running post-action listener: _resource_record_post_action 05:49:34 INFO - ##### 05:49:34 INFO - ##### Finished populate-webroot step (success) 05:49:34 INFO - ##### 05:49:34 INFO - ##### 05:49:34 INFO - ##### Running create-virtualenv step. 05:49:34 INFO - ##### 05:49:34 INFO - Running pre-action listener: _resource_record_pre_action 05:49:34 INFO - Running main action method: create_virtualenv 05:49:34 INFO - Creating virtualenv /builds/slave/test/build/venv 05:49:34 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 05:49:34 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:49:34 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:49:34 INFO - Using real prefix '/usr' 05:49:34 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:49:35 INFO - Installing distribute.............................................................................................................................................................................................done. 05:49:37 INFO - Installing pip.................done. 05:49:37 INFO - Return code: 0 05:49:37 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:49:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 05:49:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:49:37 INFO - Using env: {'DISPLAY': ':0', 05:49:37 INFO - 'HOME': '/home/cltbld', 05:49:37 INFO - 'LANG': 'en_US.UTF-8', 05:49:37 INFO - 'LANGUAGE': 'en_US:en', 05:49:37 INFO - 'LOGNAME': 'cltbld', 05:49:37 INFO - 'MAIL': '/var/mail/cltbld', 05:49:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:37 INFO - 'MOZ_NO_REMOTE': '1', 05:49:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:37 INFO - 'NO_EM_RESTART': '1', 05:49:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:37 INFO - 'PWD': '/builds/slave/test', 05:49:37 INFO - 'SHELL': '/bin/bash', 05:49:37 INFO - 'SHLVL': '1', 05:49:37 INFO - 'TERM': 'linux', 05:49:37 INFO - 'TMOUT': '86400', 05:49:37 INFO - 'USER': 'cltbld', 05:49:37 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:37 INFO - '_': '/tools/buildbot/bin/python'} 05:49:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:37 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 05:49:37 INFO - Cleaning up... 05:49:37 INFO - Return code: 0 05:49:37 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:49:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 05:49:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 05:49:37 INFO - Using env: {'DISPLAY': ':0', 05:49:37 INFO - 'HOME': '/home/cltbld', 05:49:37 INFO - 'LANG': 'en_US.UTF-8', 05:49:37 INFO - 'LANGUAGE': 'en_US:en', 05:49:37 INFO - 'LOGNAME': 'cltbld', 05:49:37 INFO - 'MAIL': '/var/mail/cltbld', 05:49:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:37 INFO - 'MOZ_NO_REMOTE': '1', 05:49:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:37 INFO - 'NO_EM_RESTART': '1', 05:49:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:37 INFO - 'PWD': '/builds/slave/test', 05:49:37 INFO - 'SHELL': '/bin/bash', 05:49:37 INFO - 'SHLVL': '1', 05:49:37 INFO - 'TERM': 'linux', 05:49:37 INFO - 'TMOUT': '86400', 05:49:37 INFO - 'USER': 'cltbld', 05:49:37 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:37 INFO - '_': '/tools/buildbot/bin/python'} 05:49:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:37 INFO - Downloading/unpacking psutil>=3.1.1 05:49:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:49:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:49:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:49:39 INFO - Installing collected packages: psutil 05:49:39 INFO - Running setup.py install for psutil 05:49:39 INFO - building 'psutil._psutil_linux' extension 05:49:39 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 05:49:40 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 05:49:40 INFO - building 'psutil._psutil_posix' extension 05:49:40 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 05:49:40 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 05:49:40 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:49:40 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:49:40 INFO - Successfully installed psutil 05:49:40 INFO - Cleaning up... 05:49:40 INFO - Return code: 0 05:49:40 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:49:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 05:49:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 05:49:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 05:49:40 INFO - Using env: {'DISPLAY': ':0', 05:49:40 INFO - 'HOME': '/home/cltbld', 05:49:40 INFO - 'LANG': 'en_US.UTF-8', 05:49:40 INFO - 'LANGUAGE': 'en_US:en', 05:49:40 INFO - 'LOGNAME': 'cltbld', 05:49:40 INFO - 'MAIL': '/var/mail/cltbld', 05:49:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:40 INFO - 'MOZ_NO_REMOTE': '1', 05:49:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:40 INFO - 'NO_EM_RESTART': '1', 05:49:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:40 INFO - 'PWD': '/builds/slave/test', 05:49:40 INFO - 'SHELL': '/bin/bash', 05:49:40 INFO - 'SHLVL': '1', 05:49:40 INFO - 'TERM': 'linux', 05:49:40 INFO - 'TMOUT': '86400', 05:49:40 INFO - 'USER': 'cltbld', 05:49:40 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:40 INFO - '_': '/tools/buildbot/bin/python'} 05:49:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:40 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:49:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:42 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:49:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:49:42 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:49:42 INFO - Installing collected packages: mozsystemmonitor 05:49:42 INFO - Running setup.py install for mozsystemmonitor 05:49:42 INFO - Successfully installed mozsystemmonitor 05:49:42 INFO - Cleaning up... 05:49:42 INFO - Return code: 0 05:49:42 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:49:42 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')]} 05:49:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:42 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')]} 05:49:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:42 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 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 05:49:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 05:49:42 INFO - Using env: {'DISPLAY': ':0', 05:49:42 INFO - 'HOME': '/home/cltbld', 05:49:42 INFO - 'LANG': 'en_US.UTF-8', 05:49:42 INFO - 'LANGUAGE': 'en_US:en', 05:49:42 INFO - 'LOGNAME': 'cltbld', 05:49:42 INFO - 'MAIL': '/var/mail/cltbld', 05:49:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:42 INFO - 'MOZ_NO_REMOTE': '1', 05:49:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:42 INFO - 'NO_EM_RESTART': '1', 05:49:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:42 INFO - 'PWD': '/builds/slave/test', 05:49:42 INFO - 'SHELL': '/bin/bash', 05:49:42 INFO - 'SHLVL': '1', 05:49:42 INFO - 'TERM': 'linux', 05:49:42 INFO - 'TMOUT': '86400', 05:49:42 INFO - 'USER': 'cltbld', 05:49:42 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:42 INFO - '_': '/tools/buildbot/bin/python'} 05:49:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:42 INFO - Downloading/unpacking jsonschema==2.5.1 05:49:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:44 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:49:44 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:49:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:44 INFO - Downloading functools32-3.2.3-2.tar.gz 05:49:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:49:45 INFO - warning: no files found matching '*.txt' 05:49:45 INFO - no previously-included directories found matching 'build' 05:49:45 INFO - no previously-included directories found matching 'dist' 05:49:45 INFO - no previously-included directories found matching '.git*' 05:49:45 INFO - Installing collected packages: jsonschema, functools32 05:49:45 INFO - Running setup.py install for functools32 05:49:45 INFO - warning: no files found matching '*.txt' 05:49:45 INFO - no previously-included directories found matching 'build' 05:49:45 INFO - no previously-included directories found matching 'dist' 05:49:45 INFO - no previously-included directories found matching '.git*' 05:49:45 INFO - Successfully installed jsonschema functools32 05:49:45 INFO - Cleaning up... 05:49:45 INFO - Return code: 0 05:49:45 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:49: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')]} 05:49:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49: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')]} 05:49:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:45 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 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 05:49:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:49:45 INFO - Using env: {'DISPLAY': ':0', 05:49:45 INFO - 'HOME': '/home/cltbld', 05:49:45 INFO - 'LANG': 'en_US.UTF-8', 05:49:45 INFO - 'LANGUAGE': 'en_US:en', 05:49:45 INFO - 'LOGNAME': 'cltbld', 05:49:45 INFO - 'MAIL': '/var/mail/cltbld', 05:49:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:45 INFO - 'MOZ_NO_REMOTE': '1', 05:49:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:45 INFO - 'NO_EM_RESTART': '1', 05:49:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:45 INFO - 'PWD': '/builds/slave/test', 05:49:45 INFO - 'SHELL': '/bin/bash', 05:49:45 INFO - 'SHLVL': '1', 05:49:45 INFO - 'TERM': 'linux', 05:49:45 INFO - 'TMOUT': '86400', 05:49:45 INFO - 'USER': 'cltbld', 05:49:45 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:45 INFO - '_': '/tools/buildbot/bin/python'} 05:49:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:45 INFO - Downloading/unpacking blobuploader==1.2.4 05:49:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:47 INFO - Downloading blobuploader-1.2.4.tar.gz 05:49:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:49:47 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:49:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:49:47 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:49:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:48 INFO - Downloading docopt-0.6.1.tar.gz 05:49:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:49:48 INFO - Installing collected packages: blobuploader, requests, docopt 05:49:48 INFO - Running setup.py install for blobuploader 05:49:48 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:49:48 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:49:48 INFO - Running setup.py install for requests 05:49:48 INFO - Running setup.py install for docopt 05:49:48 INFO - Successfully installed blobuploader requests docopt 05:49:48 INFO - Cleaning up... 05:49:48 INFO - Return code: 0 05:49:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:49: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')]} 05:49:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49: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')]} 05:49:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:49:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:49:48 INFO - Using env: {'DISPLAY': ':0', 05:49:48 INFO - 'HOME': '/home/cltbld', 05:49:48 INFO - 'LANG': 'en_US.UTF-8', 05:49:48 INFO - 'LANGUAGE': 'en_US:en', 05:49:48 INFO - 'LOGNAME': 'cltbld', 05:49:48 INFO - 'MAIL': '/var/mail/cltbld', 05:49:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:48 INFO - 'MOZ_NO_REMOTE': '1', 05:49:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:48 INFO - 'NO_EM_RESTART': '1', 05:49:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:48 INFO - 'PWD': '/builds/slave/test', 05:49:48 INFO - 'SHELL': '/bin/bash', 05:49:48 INFO - 'SHLVL': '1', 05:49:48 INFO - 'TERM': 'linux', 05:49:48 INFO - 'TMOUT': '86400', 05:49:48 INFO - 'USER': 'cltbld', 05:49:48 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:48 INFO - '_': '/tools/buildbot/bin/python'} 05:49:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:49:48 INFO - Running setup.py (path:/tmp/pip-UXa4hD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:49:49 INFO - Running setup.py (path:/tmp/pip-eakXTX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:49:49 INFO - Running setup.py (path:/tmp/pip-EQoxjW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:49:49 INFO - Running setup.py (path:/tmp/pip-yuhGvf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:49:49 INFO - Running setup.py (path:/tmp/pip-fvroLR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:49:49 INFO - Running setup.py (path:/tmp/pip-YyQDbH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:49:49 INFO - Running setup.py (path:/tmp/pip-LVIguH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:49:49 INFO - Running setup.py (path:/tmp/pip-KeNPyH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:49:49 INFO - Running setup.py (path:/tmp/pip-nSAPei-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:49:49 INFO - Running setup.py (path:/tmp/pip-MrcldU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:49:49 INFO - Running setup.py (path:/tmp/pip-nBXYfL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:49:49 INFO - Running setup.py (path:/tmp/pip-GHrdZg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:49:49 INFO - Running setup.py (path:/tmp/pip-YEfbCP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:49:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:49:49 INFO - Running setup.py (path:/tmp/pip-K9AL8y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:49:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:49:50 INFO - Running setup.py (path:/tmp/pip-NQu_It-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:49:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:49:50 INFO - Running setup.py (path:/tmp/pip-1AyzzA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:49:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:49:50 INFO - Running setup.py (path:/tmp/pip-jtOxhn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:49:50 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:49:50 INFO - Running setup.py install for manifestparser 05:49:50 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:49:50 INFO - Running setup.py install for mozcrash 05:49:50 INFO - Running setup.py install for mozdebug 05:49:50 INFO - Running setup.py install for mozdevice 05:49:50 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:49:50 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:49:50 INFO - Running setup.py install for mozfile 05:49:50 INFO - Running setup.py install for mozhttpd 05:49:50 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:49:50 INFO - Running setup.py install for mozinfo 05:49:50 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:49:50 INFO - Running setup.py install for mozInstall 05:49:51 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Running setup.py install for mozleak 05:49:51 INFO - Running setup.py install for mozlog 05:49:51 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Running setup.py install for moznetwork 05:49:51 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Running setup.py install for mozprocess 05:49:51 INFO - Running setup.py install for mozprofile 05:49:51 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Running setup.py install for mozrunner 05:49:51 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:49:51 INFO - Running setup.py install for mozscreenshot 05:49:51 INFO - Running setup.py install for moztest 05:49:51 INFO - Running setup.py install for mozversion 05:49:51 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:49:52 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:49:52 INFO - Cleaning up... 05:49:52 INFO - Return code: 0 05:49:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:49:52 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')]} 05:49:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:52 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')]} 05:49:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:52 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 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:49:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:49:52 INFO - Using env: {'DISPLAY': ':0', 05:49:52 INFO - 'HOME': '/home/cltbld', 05:49:52 INFO - 'LANG': 'en_US.UTF-8', 05:49:52 INFO - 'LANGUAGE': 'en_US:en', 05:49:52 INFO - 'LOGNAME': 'cltbld', 05:49:52 INFO - 'MAIL': '/var/mail/cltbld', 05:49:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:52 INFO - 'MOZ_NO_REMOTE': '1', 05:49:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:52 INFO - 'NO_EM_RESTART': '1', 05:49:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:52 INFO - 'PWD': '/builds/slave/test', 05:49:52 INFO - 'SHELL': '/bin/bash', 05:49:52 INFO - 'SHLVL': '1', 05:49:52 INFO - 'TERM': 'linux', 05:49:52 INFO - 'TMOUT': '86400', 05:49:52 INFO - 'USER': 'cltbld', 05:49:52 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:52 INFO - '_': '/tools/buildbot/bin/python'} 05:49:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:49:52 INFO - Running setup.py (path:/tmp/pip-PmicAt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:49:52 INFO - Running setup.py (path:/tmp/pip-NbUqsN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:49:52 INFO - Running setup.py (path:/tmp/pip-8ls9JN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:49:52 INFO - Running setup.py (path:/tmp/pip-2v18_q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:49:52 INFO - Running setup.py (path:/tmp/pip-YcRJ26-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:49:52 INFO - Running setup.py (path:/tmp/pip-XGjHjQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:49:52 INFO - Running setup.py (path:/tmp/pip-rIFWCy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:49:52 INFO - Running setup.py (path:/tmp/pip-s50Tnq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:49:52 INFO - Running setup.py (path:/tmp/pip-H8r1jU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:49:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:49:52 INFO - Running setup.py (path:/tmp/pip-UlRMqR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:49:52 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)) 05:49:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:49:52 INFO - Running setup.py (path:/tmp/pip-hqtH88-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 05:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:49:53 INFO - Running setup.py (path:/tmp/pip-Pi7THk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 05:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:49:53 INFO - Running setup.py (path:/tmp/pip-2pKda_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 05:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:49:53 INFO - Running setup.py (path:/tmp/pip-z_vpyS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 05:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:49:53 INFO - Running setup.py (path:/tmp/pip-dC6hLT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 05:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:49:53 INFO - Running setup.py (path:/tmp/pip-oy_H3u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 05:49:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:49:53 INFO - Running setup.py (path:/tmp/pip-mo5CVC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:49:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:49:53 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:49:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:49:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:49:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:49:55 INFO - Downloading blessings-1.6.tar.gz 05:49:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:49:55 INFO - Installing collected packages: blessings 05:49:55 INFO - Running setup.py install for blessings 05:49:55 INFO - Successfully installed blessings 05:49:55 INFO - Cleaning up... 05:49:55 INFO - Return code: 0 05:49:55 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:49:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:49:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:49:55 INFO - Reading from file tmpfile_stdout 05:49:55 INFO - Current package versions: 05:49:55 INFO - argparse == 1.2.1 05:49:55 INFO - blessings == 1.6 05:49:55 INFO - blobuploader == 1.2.4 05:49:55 INFO - docopt == 0.6.1 05:49:55 INFO - functools32 == 3.2.3-2 05:49:55 INFO - jsonschema == 2.5.1 05:49:55 INFO - manifestparser == 1.1 05:49:55 INFO - mozInstall == 1.12 05:49:55 INFO - mozcrash == 0.17 05:49:55 INFO - mozdebug == 0.1 05:49:55 INFO - mozdevice == 0.48 05:49:55 INFO - mozfile == 1.2 05:49:55 INFO - mozhttpd == 0.7 05:49:55 INFO - mozinfo == 0.9 05:49:55 INFO - mozleak == 0.1 05:49:55 INFO - mozlog == 3.2 05:49:55 INFO - moznetwork == 0.27 05:49:55 INFO - mozprocess == 0.23 05:49:55 INFO - mozprofile == 0.28 05:49:55 INFO - mozrunner == 6.12 05:49:55 INFO - mozscreenshot == 0.1 05:49:55 INFO - mozsystemmonitor == 0.3 05:49:55 INFO - moztest == 0.7 05:49:55 INFO - mozversion == 1.4 05:49:55 INFO - psutil == 3.1.1 05:49:55 INFO - requests == 1.2.3 05:49:55 INFO - wsgiref == 0.1.2 05:49:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:49:55 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')]} 05:49:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:55 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')]} 05:49:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:55 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 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 05:49:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:49:55 INFO - Using env: {'DISPLAY': ':0', 05:49:55 INFO - 'HOME': '/home/cltbld', 05:49:55 INFO - 'LANG': 'en_US.UTF-8', 05:49:55 INFO - 'LANGUAGE': 'en_US:en', 05:49:55 INFO - 'LOGNAME': 'cltbld', 05:49:55 INFO - 'MAIL': '/var/mail/cltbld', 05:49:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:55 INFO - 'MOZ_NO_REMOTE': '1', 05:49:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:55 INFO - 'NO_EM_RESTART': '1', 05:49:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:55 INFO - 'PWD': '/builds/slave/test', 05:49:55 INFO - 'SHELL': '/bin/bash', 05:49:55 INFO - 'SHLVL': '1', 05:49:55 INFO - 'TERM': 'linux', 05:49:55 INFO - 'TMOUT': '86400', 05:49:55 INFO - 'USER': 'cltbld', 05:49:55 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:55 INFO - '_': '/tools/buildbot/bin/python'} 05:49:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:49:56 INFO - Cleaning up... 05:49:56 INFO - Return code: 0 05:49:56 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:49:56 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')]} 05:49:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:49:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:56 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')]} 05:49:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:49:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:49:56 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 0x202e030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21918a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ef180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:49:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 05:49:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:49:56 INFO - Using env: {'DISPLAY': ':0', 05:49:56 INFO - 'HOME': '/home/cltbld', 05:49:56 INFO - 'LANG': 'en_US.UTF-8', 05:49:56 INFO - 'LANGUAGE': 'en_US:en', 05:49:56 INFO - 'LOGNAME': 'cltbld', 05:49:56 INFO - 'MAIL': '/var/mail/cltbld', 05:49:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:49:56 INFO - 'MOZ_NO_REMOTE': '1', 05:49:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:49:56 INFO - 'NO_EM_RESTART': '1', 05:49:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:49:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:49:56 INFO - 'PWD': '/builds/slave/test', 05:49:56 INFO - 'SHELL': '/bin/bash', 05:49:56 INFO - 'SHLVL': '1', 05:49:56 INFO - 'TERM': 'linux', 05:49:56 INFO - 'TMOUT': '86400', 05:49:56 INFO - 'USER': 'cltbld', 05:49:56 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:49:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:49:56 INFO - '_': '/tools/buildbot/bin/python'} 05:49:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:49:56 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:49:56 INFO - Cleaning up... 05:49:56 INFO - Return code: 0 05:49:56 INFO - Running post-action listener: _resource_record_post_action 05:49:56 INFO - Running post-action listener: _start_resource_monitoring 05:49:56 INFO - Starting resource monitoring. 05:49:56 INFO - ##### 05:49:56 INFO - ##### Finished create-virtualenv step (success) 05:49:56 INFO - ##### 05:49:56 INFO - ##### 05:49:56 INFO - ##### Running install step. 05:49:56 INFO - ##### 05:49:56 INFO - Running pre-action listener: _resource_record_pre_action 05:49:56 INFO - Running main action method: install 05:49:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:49:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:49:56 INFO - Reading from file tmpfile_stdout 05:49:56 INFO - Detecting whether we're running mozinstall >=1.0... 05:49:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:49:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:49:56 INFO - Reading from file tmpfile_stdout 05:49:56 INFO - Output received: 05:49:56 INFO - Usage: mozinstall [options] installer 05:49:56 INFO - Options: 05:49:56 INFO - -h, --help show this help message and exit 05:49:56 INFO - -d DEST, --destination=DEST 05:49:56 INFO - Directory to install application into. [default: 05:49:56 INFO - "/builds/slave/test"] 05:49:56 INFO - --app=APP Application being installed. [default: firefox] 05:49:56 INFO - mkdir: /builds/slave/test/build/application 05:49:56 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'] 05:49:56 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 05:50:13 INFO - Reading from file tmpfile_stdout 05:50:13 INFO - Output received: 05:50:13 INFO - /builds/slave/test/build/application/firefox/firefox 05:50:13 INFO - Running post-action listener: _resource_record_post_action 05:50:13 INFO - ##### 05:50:13 INFO - ##### Finished install step (success) 05:50:13 INFO - ##### 05:50:13 INFO - ##### 05:50:13 INFO - ##### Running run-tests step. 05:50:13 INFO - ##### 05:50:13 INFO - Running pre-action listener: _resource_record_pre_action 05:50:13 INFO - Running main action method: run_tests 05:50:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:50:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:50:13 INFO - Python 2.7.3 05:50:13 INFO - Return code: 0 05:50:13 INFO - grabbing minidump binary from tooltool 05:50:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:50:13 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 0x22ed3b0>, '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 0x22ee2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22ee740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:50:13 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 05:50:13 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 05:50:13 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 05:50:13 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:50:13 INFO - Return code: 0 05:50:13 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:50:13 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:50:13 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:50:13 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:50:13 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:50:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-056', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 05:50:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-056 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:50:13 INFO - Using env: {'DISPLAY': ':0', 05:50:13 INFO - 'HOME': '/home/cltbld', 05:50:13 INFO - 'LANG': 'en_US.UTF-8', 05:50:13 INFO - 'LANGUAGE': 'en_US:en', 05:50:13 INFO - 'LOGNAME': 'cltbld', 05:50:13 INFO - 'MAIL': '/var/mail/cltbld', 05:50:13 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:50:13 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:50:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:50:13 INFO - 'MOZ_NO_REMOTE': '1', 05:50:13 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:50:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:50:13 INFO - 'NO_EM_RESTART': '1', 05:50:13 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:50:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:50:13 INFO - 'PWD': '/builds/slave/test', 05:50:13 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:50:13 INFO - 'SHELL': '/bin/bash', 05:50:13 INFO - 'SHLVL': '1', 05:50:13 INFO - 'TERM': 'linux', 05:50:13 INFO - 'TMOUT': '86400', 05:50:13 INFO - 'USER': 'cltbld', 05:50:13 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164', 05:50:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:50:13 INFO - '_': '/tools/buildbot/bin/python'} 05:50:13 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-056', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:50:14 INFO - mozversion application_buildid: 20160708023010 05:50:14 INFO - mozversion application_changeset: 806cd7a7b68de8777caf419239e2f4e671aaa80b 05:50:14 INFO - mozversion application_display_name: Nightly 05:50:14 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:50:14 INFO - mozversion application_name: Firefox 05:50:14 INFO - mozversion application_remotingname: firefox 05:50:14 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 05:50:14 INFO - mozversion application_vendor: Mozilla 05:50:14 INFO - mozversion application_version: 50.0a1 05:50:14 INFO - mozversion platform_buildid: 20160708023010 05:50:14 INFO - mozversion platform_changeset: 806cd7a7b68de8777caf419239e2f4e671aaa80b 05:50:14 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 05:50:14 INFO - mozversion platform_version: 50.0a1 05:50:14 INFO - using testdate: 1467982214 05:50:14 INFO - actual date: 1467982214 05:50:14 INFO - starting webserver on 'localhost:54488' 05:50:14 INFO - SUITE-START | Running 2 tests 05:50:14 INFO - TEST-START | dromaeo_css 05:50:14 INFO - operating with platform_type : linux_ 05:50:14 INFO - Initialising browser for dromaeo_css test... 05:50:14 INFO - TEST-INFO | started process 12377 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpDuVm8C/profile http://localhost:54488/getInfo.html) 05:50:19 INFO - PROCESS | 12377 | __metrics Screen width/height:1600/1200 05:50:19 INFO - PROCESS | 12377 | colorDepth:24 05:50:19 INFO - PROCESS | 12377 | Browser inner width/height: 1024/697 05:50:19 INFO - PROCESS | 12377 | __metrics 05:50:19 ERROR - PROCESS | 12377 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2957: TypeError: this.tabs is undefined 05:50:20 INFO - TEST-INFO | 12377: exit 0 05:50:20 INFO - Browser initialized. 05:50:20 INFO - Running cycle 1/1 for dromaeo_css test... 05:50:20 INFO - TEST-INFO | started process 12497 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpDuVm8C/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:50:32 INFO - PROCESS | 12497 | RSS: Main: 168488960 05:50:32 INFO - PROCESS | 12497 | 05:51:22 INFO - PROCESS | 12497 | 1467982282012 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 05:53:30 INFO - PROCESS | 12497 | Cycle 1(1): loaded http://localhost:54488/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54488/tests/dromaeo/cssquery-ext.html) 05:53:31 INFO - PROCESS | 12497 | RSS: Main: 171626496 05:53:31 INFO - PROCESS | 12497 | 05:56:33 INFO - PROCESS | 12497 | Cycle 1(1): loaded http://localhost:54488/tests/dromaeo/cssquery-ext.html (next: http://localhost:54488/tests/dromaeo/cssquery-jquery.html) 05:56:34 INFO - PROCESS | 12497 | RSS: Main: 168210432 05:56:34 INFO - PROCESS | 12497 | 05:59:36 INFO - PROCESS | 12497 | Cycle 1(1): loaded http://localhost:54488/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54488/tests/dromaeo/cssquery-mootools.html) 05:59:36 INFO - PROCESS | 12497 | RSS: Main: 171823104 05:59:36 INFO - PROCESS | 12497 | 06:02:38 INFO - PROCESS | 12497 | Cycle 1(1): loaded http://localhost:54488/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54488/tests/dromaeo/cssquery-prototype.html) 06:02:39 INFO - PROCESS | 12497 | RSS: Main: 167309312 06:02:39 INFO - PROCESS | 12497 | 06:05:41 INFO - PROCESS | 12497 | Cycle 1(1): loaded http://localhost:54488/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54488/tests/dromaeo/cssquery-yui.html) 06:05:42 INFO - PROCESS | 12497 | RSS: Main: 169390080 06:05:42 INFO - PROCESS | 12497 | 06:08:44 INFO - PROCESS | 12497 | Cycle 1(1): loaded http://localhost:54488/tests/dromaeo/cssquery-yui.html (next: http://localhost:54488/tests/dromaeo/cssquery-dojo.html) 06:08:45 INFO - PROCESS | 12497 | RSS: Main: 170516480 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - PROCESS | 12497 | __start_tp_report 06:08:45 INFO - PROCESS | 12497 | _x_x_mozilla_page_load 06:08:45 INFO - PROCESS | 12497 | _x_x_mozilla_page_load_details 06:08:45 INFO - PROCESS | 12497 | |i|pagename|runs| 06:08:45 INFO - PROCESS | 12497 | |0;dojo.html;3029.818210907346;3091.3817236552686;3099.3646302507973;3115.5949726535546;3122.422351864905;5371.871906899551;5473.15166149247;5475.6440831345935;5518.586106042053;5552.08390615549;5342.492463215988;5473.972630136844;5507.284053073105;5510.972445137779;5534.667919924807;4799.400074990626;4970.428400733907;4981.252812078181;5021.347224860763;5083.79664813407;4935.703857768527;5125.718085505296;5130.127878260686;5138.922916156242;5148.510891465324;4872.123017856784;4909.3126962225315;4930.457649658535;5047.64666473347;5056.089903817311;4937.901241975176;4942.777575009133;4943;4945.554900059012;5003.099442100421;4828.324034635154;4873.610111191097;4901.509849015106;4912.557869791736;4931.67944083637;5296.496832800916;5418.729063546846;5453.972730136364;5515.365732940723;5539.25220095286;5896.734646940898;5915.881682366328;5918.201042859202;5920.259967504062;5922.763089476416;5784.595078344518;5926.881462370771;5926.940730592682;5927.525797936155;5944.583879128462;5435.347758268994;5439.211314359396;5488.368837583689;5499.615026948075;5508.14623733318;5989.9101513477335;5990.460858522667;5990.7903223386975;5997.190379298826;6022.488088512438;5647.745851436613;5685.744141513642;5793.420657934257;5808.419158084158;5811.070228763462;5834;5846.853828654318;5846.912296315559;5848.2689663792025;5899.646021238739;5671.943280567224;5780.913286300709;5803.709814509258;5813.069908814569;5871;5611.382747897728;5631.4087020863035;5851.678157701367;5880.970595146997;5888.263967004124;4361.629261512807;4374.737515749065;4395.824167033346;4433.224185767478;4468.128714900628;3908.511436070491;3924.0778417071965;3930.390789427643;3956.584558621303;3956.9010774730864;5554.472325129106;5602.831915042555;5635.323761148688;5642.71786410686;5658.74535645897;5769.163471296639;5800.274965629296;5855.853603659943;5856.648601083949;5860.238169037998;5612.214289999403;5658.434156584309;5670.8015219467125;5671.9716401418555;5676.035074037423;4890.95109048912;4988.551030407209;5044.394672639307;5044.697318160922;5050.393952725696;6095.451409373178;6117.063650123445;6129.267100814801;6182.567220294536;6186.876262474815;5946.108083787466;5968.612040217372;5976.252968378953;5982.551308651781;5989.0716938873675;5933.347331793413;5958.612690175125;6181.690915454299;6204.317525072329;6210.378962103934;5649.152627105967;5746.281714785652;5758.884822303614;5778.8844223114465;5780.826575202751;5839.912401313899;5848.824535263949;5870.295564532284;5871.089981052944;5895.29256489224;5469.3983661797965;5696.458836410535;5709.714514274353;5744.62129089024;5781.161731548817;5511.8149597836655;5541.473560011793;5553.194786755817;5587.357453892691;5859.677717725395;5489.972550137224;5507.311586051744;5510.614257001971;5514.61397702157;5516.613837031369;5499.092649712753;5571.1086226203615;5588.441155884379;5744.023516002206;5756.856078598069;5587.944120558743;5597.80407685729;5632.042552765957;5659.179418984307;5711.885762284648 06:08:45 INFO - PROCESS | 12497 | |1;ext.html;547.1892026336412;581.2356750872602;598.7575032111994;604.7732100462327;646.0857886091181;38536;41837;41840.79079604598;41879.371809422846;42035.78982105093;41790;42552.361714574305;42608;42631.78684106583;42723;8649.870251946226;8825.602847871829;8851.645934162625;8855.114488551159;8855.24730397917;8803.911960880374;8894.955525222365;8905.465672059665;8911.420757650765;8919.286457083417;8868.113188681145;8920.866187007168;8927.330450216226;8958.417702849294;8965.282777377826;8820.779480513007;8880.600372983232;8930.776730581723;8935.910640893573;8939.32955028369;8736.956315218384;8747.212750852454;8767.912320876838;8813.338999575057;8824.955875220647;41005.79497102525;41326;41545.37681934774;41609.167816643494;41842.58157418417;2840.182283338665;3243.9837800811083;3496.667816557423;3515.59570649376;4137.937930931039;28786.136415907557;29379.118626441243;30852.382952340828;32211.19472013195;32640.836795816107;4207.056708367656;4216.198922204771;4276.001938187805;4291.635211007068;4345.69580129391;281710;284104;284883;285665;286829.9999999979;33636.66363336335;33646;33724.49413258803;33743.325133497194;33750.83124584361;35534.466982995276;36139.81930090333;36456.27087458289;37538.43692344617;38105.80947095247;17230.655386892442;17278.91360543189;17521.824781752275;17524.123793810515;17592.384266550864;12511.812322815165;12558.74882502345;12565.246085234916;12602.180858244184;12603.306818125091;19362.12193111705;19506.891210231526;19541.413757587296;19583.77481457791;19693.704594431096;7196.856062878713;7225.674844631899;7332.523385979895;7359.1169059713175;7380.409567234608;970.0832713086207;1011.4740335025892;1028.2339656955617;1030.3674112642123;1082.3181395720646;32412;32454.09348689625;32685;32945.176370590925;33002.17494562655;1060.1042119409087;1127.6842484104463;1148.7128217945515;1194.7002021109329;1225.3689349984766;16383.508494745176;16823.600145091015;16834.747478787827;16967.91516042412;17250.827491724922;569302;570300;571684;574568;575403;40393.39409908854;40448;40635.59364406318;40709.59290407058;40774.79612601918;1322.3256139368991;1380.5513208207374;1381.3990913952464;1382.6819831438825;1387.4727603510803;31098.53352199764;31668.208294792814;32055.198620034687;32069.198270042503;32490.675093248767;49605.50394496009;50113.24830127624;50222.49777502324;50305.24542131944;50553.24170137524;497536;508186;511266;511468;512475;27208;27674.44651107007;27956.44087118287;28054.2986425341;28136;47422;48062.759686201345;48587.570621468076;49024.50975490199;50086;40093.79953100216;41241.76274711763;42289.57710422856;42550.57449425466;42947.14105717931;41054;41694.79152604217;41790.582094178666;41965.790171048946;42330.576694232666;41377.586224137376;41428.378574322014;42484.36273455839;43035;45738.31392529048;41871.796021461596;45442.45575442429;46031.309530356404;48454.757726211144;48736;32743.18142046468;33469;35123.64876351306;35367.46948795718;35516.82241588776 06:08:45 INFO - PROCESS | 12497 | |2;jquery.html;382.6250274730764;382.8985318890494;383.4105754123145;385.9112404147046;397.2749731739576;18130.18414171362;19812.702809457835;19895.701564476527;20401.59196816063;20450.07974641141;16141.919290403532;16418.26117824698;16483.093429861354;17983.19075641596;19926;5810.506106980901;5862.853428664275;5969.22400087988;5985.431384018511;6000.609960352563;5646.717664116798;5783.6529808211435;5814.4185581441725;5871.794487192949;5876.11858221266;5735.168400581913;5770.480656740892;5776.393478684719;5787.450192231731;5855.707214639251;5697.487226149646;5765.077587585966;5780.046292361755;5832.766689332421;5845.766169353221;4984.700917944935;5129.0767661820855;5147.716875571842;5314.362276526803;5339.172428273624;14077.014608977375;14114.153150810882;14132.22272774997;21842;23001;2171.3811563704426;2222.8777417242045;2318.14228735369;2380.262118743195;2732.7540521352976;9535.761605959837;10148.746281342952;10274.178065754722;10591.099756520705;10611.78776424475;1976.2391479280436;1994.5611965367596;2000.1899230811543;2002.3292197113985;2028.868123571963;86143;88140.5592972031;88546;88765;89103;10703.357798532114;11117.22179447431;11172.329660220414;11233.606823761129;11321.584801899762;15256.313465894062;15262.465813696468;15422.151781652117;15442.768358474632;15468;7982.481138726081;8531.10423405546;8531.402801803939;8565.571721413904;8688.6524539019;8304.70933517324;8312.21034001769;8337.708180213664;8461.873071903927;8464.322854171774;4745.477997420281;4756.381670382828;4778.4982576829625;4888.706677599355;4919.557239848359;1951;1986.4636548132212;1991.4878347802605;2046.9897650511653;2052.127845665586;914.6661468564059;937.8827646544182;975.3465178330536;991.5785791038779;1079.5465904320204;19745.901270493556;20577.485562860747;20590.897045514677;20639.380818575468;20688.069036893376;986.2455221755363;1003.9949800250952;1018.9286749927583;1020.3724709303725;1037.9532921018572;10728;11335.489902954387;11455.198136130392;11547.653570392902;11630.76738465226;451304;453821;457060;469670;482211;72474.63762681259;81846.59076704698;92743;94963;97561.51219244;983.1839573154265;989.8218320702342;1011.1809434358194;1015.0559979219397;1023.5394072667478;16303.429379971643;18165.909170454062;18651.626967460303;18685.626287473904;18886.43340699781;29862.70137298686;31205.843970780003;35237.64762352344;37225.88322350334;44196.33705494356;59723;60123.69938150281;60403.69798150981;61567.38432615796;61752;7593.430492712958;8148.714794982147;8781.29749620016;8794.29645628361;8890.244329232088;13947;14308.427662893784;14437.639059023608;14538.781918271447;14599.343029563483;12532.686682833002;12539.37303134858;12640.936795315965;12642.810357844824;12790.936045319713;12205.816912746139;12306.323152226714;12376.195547289397;12450;12608.621741347773;12112.697182570153;12178.878211217774;12229.571964981184;12283.508659653513;12299.200551964093;7935.2064793522495;8142.959285203536;8222.342212623096;8364.159884825329;8386.874196886929;12136.575219867615;12397.75204495923;12480.375981201085;12582.496700131893;12590.370481476073 06:08:45 INFO - PROCESS | 12497 | |3;mootools.html;1435.3756116089505;1471.7056588682262;1577.6134846962495;1749.4664127441142;1766.6378392429554;7507.549547027183;8214.958925205381;8221.712240071598;8710.695125670594;8768.386212965095;8417;8670.43642163259;8679.783005424868;8688.478691278528;8700.956495217531;2221.7000704904794;2255.796978271955;2276.567452184088;2281.0305620111385;2282.47503074293;2197.571473562656;2264.388615073929;2265.105283413051;2275.3856458756127;2281.087564974007;2234.3632064861517;2240.484688521641;2249.9425270123015;2257;2288.9542209155807;2199.7250343707037;2210.403191138392;2217.73387193537;2221.6556433752635;2231.7098777159026;2186.2348178137686;2192.9451763705874;2192.9780702192934;2194.572058448603;2197.8791166486;8737.038925718229;8759.868601970975;8770.912290877073;8822;8831.735047948507;4877.6341774367065;4945.109880221558;4978.8050867791835;5004.699718016931;5012.72430016349;3376.679215474526;3376.864925402981;3419.9316013679836;3509.8069606171653;3523.365794157051;1153.532819208222;1158.6755708401577;1162.9476673549711;1164.825276208567;1170.4732870208354;11882;11886.762264754743;11904.345261010641;11912.166148369532;11918.046556275478;4310.849120280775;4320.243957307459;4407.382966384709;4549.5905368517;4552.863414097583;10154.086132248132;10159.339642923334;10184.439855807854;10194.643187488402;10221.642242521477;5003.4746351633285;5026.246063090565;5048.570871475892;5054.721990290569;5059.241113832881;4058.857939972087;4567.36056952027;4585.151746926829;4621.2837010263465;4709.0817290628;3762.529683789526;3855.1133239355104;3905.6094390560716;3961.6830653547645;3990.3016972029777;1243.3783108445778;1248.1450206608502;1249.1256120715354;1275.5153041844226;1281.2708929979085;845.2139510255398;902.8916530016309;953.8616900549521;958.4266245131844;976.6093562575027;5701.71491425427;6130.938690613126;6135.141080248769;6154.107654390178;6271.216097987752;442.4690371554148;448.428253976183;452.58362306677935;453.66202179376575;456.26769035697225;4262.786860656955;4339.5660433956355;4347.217500849877;4360.193364227628;4376;10226.53980570876;10585.89414105849;10595.258331916692;10718.73203169927;10775.515101820436;10147.086762191439;10572.259941803999;10626.256162068736;10631.202659800545;10678.946605266923;7905.604719764104;8121;8136.511809291462;8144.796380090426;8169.4689845161065;6080.391960803884;6385.361463853763;6393.424591786761;6412.23053233615;6420.711068002044;10106.949465252626;10180.541875615467;10238.488075596042;10252.43611601369;10269.229807764297;9956.651517196864;9976.800463990825;9998.100170984646;10200.744981375228;10271.7432064199;6749.898751518633;7112.50212485121;7372.373348265243;7463.477556570988;7598.35413989795;8481.787955301166;8509.702160424355;8510.70212542558;8574.871376929226;8603.784905377415;7389.371903388273;7627.961860190663;7641.6561254742555;7648;7673.6546855390525;7397.26027397256;7420.5176663516695;7462;7499.737509187153;7588.127365353055;7149.892751608626;7179.066721326194;7233.602151881697;7237.963810180915;7242.89135662955;5208.609354298367;5291.550218231493;5389.434109418611;5436.6194366393975;5439.48324909133;5238.580913526985;5327.760250788646;5357.866053348697;5495.422980587141;5500.50495455411 06:08:45 INFO - PROCESS | 12497 | |4;prototype.html;305.12885711294257;312.8889244318267;313.33260155868;314.529777981917;325.682459601888;5430.239766432703;5564.276644036269;5567.443255674436;5602.187682785993;5664.886702265957;5548.056830338842;5578.429804924841;5579.326202139362;5580.91628625571;5583.553315734742;4319.892002699926;4324.589164029412;4337.93493097603;4339.674524410666;4359.215341238576;4026.778527181004;4228.640565551932;4232.788360581959;4344;4359.629431498326;4220.324748040314;4232.661387089025;4240.342746874239;4249.426327445786;4263.846757387515;4250.213710463574;4257;4264.552222016706;4304.870853874389;4308.375285583604;3560.5193298904574;3755.8122093895195;3767.9058023549355;3768.566614839274;3770.811459427018;5444.992676354847;5449.373322067973;5449.427810079924;5466.644668096561;5501.5323697485765;4899.657024008321;4918.483559226265;4926.556609905126;4930.901381972376;4957.578605818474;5572.5263352615075;5829.446202610745;5831.475167234969;5840.218733286346;5850.3564607893095;4078.3066878630702;4087.7532352632434;4088;4088.5093788745244;4129.772862492562;6048;6051.878962420727;6063.939360606426;6119.204503414572;6133.355997620275;4072.8778136655947;4165.125323682;4181.975416023094;4184.581541845791;4240.575942405796;4229.450171477688;4248.596383343577;4259.339802330644;4268.530461649216;4272.444582204355;4898.608111351084;4927.90144197114;4930.556249937523;4944.777485013183;4962.950370496321;5674.177244299553;5878.5297176225795;5930.703464826742;5952.3154837193415;5972.611780234358;1456.6722487440454;1481.451862810767;1483.3769816677022;1487.7619580867226;1494.4993427201791;906.9138431848963;919.4529255093208;924.9778994211434;925.4169872979979;928.4197376639601;5008.273800298936;5011.57401620859;5042.588075338837;5051.852962490927;5067.315912351859;5213.921791173136;5238.319018527567;5255.527002569711;5315.840524784263;5341.519263266325;5057.367829021372;5062.949370506248;5080.187170052774;5373.35519737634;5848.707564621752;3183.5224716292278;3215.5176723491663;3218.9678103218666;3220.4686226772787;3221.275213077086;6136.9079463808075;6256.874862502725;6281.466075383552;6298.149749783812;6305.873882522324;6098.268207815002;6106.786262480792;6115.449609535163;6128.754849806047;6132.969335153296;6142.416470435391;6242.75028998844;6278.46633036197;6294.653794041372;6345.809625711236;5798.855028624318;5906.616069955439;5985.880282394415;6040.335563087969;6042.579993701389;6003.429674180946;6007.459328660441;6013.9699301503215;6030.246219222598;6043.395660434097;6112.72492737819;6226.40849119333;6306.211723534559;6308.791922826974;6375.4262116409745;4175.832966681299;4178.603032711888;4193.433886425293;4209.137126888919;4218.599233072853;6074.119252708421;6138.8643101026455;6141.938580614136;6156.199694039925;6174.38256174379;5756.280464941882;5900.380460051804;5906.70466476683;5924.659759395101;5939.821805345847;5871.412858714094;5886.175935369138;5913.881722365614;5914.290285165807;5950.601608622057;5513.779448822002;5788.321386797781;5796.507296879812;5826.155207494805;5890.263717035371;5965.761369545343;5971.7611295547695;5976.372480889444;5988.161657367885;5997.590566216848;5757.165211044459;5804.564657650609;5830.854228644148;5842.152887831326;5931.436513531207 06:08:45 INFO - PROCESS | 12497 | |5;yui.html;764.2204950950031;788.7515432638719;792.5918550233993;797.0744085379505;871.2507243770357;15385.230738463088;16115.435959741411;16164.515064548068;16172.0296782193;16218.432354867553;14439.711205775879;14451.349689263981;14544.345504452298;14576.781348279757;14607.196604186765;796.5300472721079;816.1593558634615;816.322452364536;817.3093735793245;817.6075483767795;658.9934100659004;773.5358784729174;807.5114555693809;810.5541951926417;813.4631143445328;863.197226579281;870.6647940542873;873.7422460374173;874.8950125984859;877.7893305606673;870.11683141611;872.0538216035577;872.764353624521;873.205383101381;873.8995015573227;630.7350912616712;630.7540059376847;632.4782054804805;633.2021652717563;635.6726285962686;15237;15245;15247.923760381127;15255.694886102216;15257.61855953599;15778.605534861605;15930.920345398315;15966.361345546164;16157.757633635387;16162.515124546166;12268.570600029045;12370.13409061357;12455.875441245653;12478.18891772041;12552.937235313764;3959.762414255154;3970.82131304092;3989.3617021276455;3993.341098718708;4140.254754144253;75320.24679753187;75689.62155189244;76128.61935690285;76417;77405;12082.516699332104;12154;12288.508459661514;12412.751744965231;12521.812172817416;22843.657345139836;23094.191703290304;23149.07403703833;23218.883905580366;23252.883735581214;7887.723929662434;8254.339652827759;8367.330613550901;8418;8743.387962842668;4913.21388577833;5003.674761140514;5013.974930125326;5024.447310795809;5087.669301495391;3483.634218407031;3617.511635929116;3621.8370173341737;3633.691136253448;3635.2002559436883;636.0872148466965;638.8019713888709;640.5516138702926;658.4567731621431;664.2792570061441;625.7934881489098;650.177525430331;701.4949236549676;708.4049398505177;726.8146622611306;9298.907010929805;9362.672306469241;9514.666986655433;9793.755156121155;10062.39625622465;582.9186858377649;592.6740292838921;638.1735652330243;703.7923812475332;723.6381809095452;4392.9676526016365;4498.145352383102;4521.465770663687;4580.24425969718;4597.793099310539;71216;113717.4314128424;113909.43045284886;117326;118307.40846295886;57534;75551;94329;95274.52362738142;95376;52981;54400.18399724007;74555.25444745591;84821;88092.11907881095;9004.762849771883;9005.189532942066;9061.13919177677;9164.175224229852;9412.811743765224;50393.74015649638;51228.231576525635;52339.47660523346;52365.47634523606;52726.20910686266;64252.678736607886;65216;65303.673481632286;66333.66833165803;72328;13100.60698179056;13496.392662330023;13691.45234190661;13835.654108647364;13838.584842454742;15336.69326613439;15388.923055384652;15541.37834486653;15688.529344119695;16245.431409900597;14154.433822646979;14470.927645361706;14730.926345368205;14747.041442306216;15607.765883511529;13883.861161388257;13985.720285594027;14309.856901430852;14336.068155569854;14630.341634626255;14146.646333841736;14426.42294308216;14440.277986100864;14677.045992010486;14726.926365368105;10824.891751082389;11226.887731122584;11275.379854108103;11297.322160670386;11502.367369794407;10464.895351046393;10893.346399216072;11855.288682679067;12091.214071085351;12263.75472490563 06:08:45 INFO - PROCESS | 12497 | __end_tp_report 06:08:45 INFO - PROCESS | 12497 | __start_cc_report 06:08:45 INFO - PROCESS | 12497 | _x_x_mozilla_cycle_collect,367 06:08:45 INFO - PROCESS | 12497 | __end_cc_report 06:08:45 INFO - PROCESS | 12497 | __startTimestamp1467983325235__endTimestamp 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - PROCESS | 12497 | ------- Summary: start ------- 06:08:45 INFO - PROCESS | 12497 | Number of tests: 6 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - PROCESS | 12497 | [#0] dojo.html Cycles:165 Average:5429.00 Median:5611.38 stddev:639.38 (11.4%) stddev-sans-first:613.02 06:08:45 INFO - PROCESS | 12497 | Values: 3029.8 3091.4 3099.4 3115.6 3122.4 5371.9 5473.2 5475.6 5518.6 5552.1 5342.5 5474.0 5507.3 5511.0 5534.7 4799.4 4970.4 4981.3 5021.3 5083.8 4935.7 5125.7 5130.1 5138.9 5148.5 4872.1 4909.3 4930.5 5047.6 5056.1 4937.9 4942.8 4943.0 4945.6 5003.1 4828.3 4873.6 4901.5 4912.6 4931.7 5296.5 5418.7 5454.0 5515.4 5539.3 5896.7 5915.9 5918.2 5920.3 5922.8 5784.6 5926.9 5926.9 5927.5 5944.6 5435.3 5439.2 5488.4 5499.6 5508.1 5989.9 5990.5 5990.8 5997.2 6022.5 5647.7 5685.7 5793.4 5808.4 5811.1 5834.0 5846.9 5846.9 5848.3 5899.6 5671.9 5780.9 5803.7 5813.1 5871.0 5611.4 5631.4 5851.7 5881.0 5888.3 4361.6 4374.7 4395.8 4433.2 4468.1 3908.5 3924.1 3930.4 3956.6 3956.9 5554.5 5602.8 5635.3 5642.7 5658.7 5769.2 5800.3 5855.9 5856.6 5860.2 5612.2 5658.4 5670.8 5672.0 5676.0 4891.0 4988.6 5044.4 5044.7 5050.4 6095.5 6117.1 6129.3 6182.6 6186.9 5946.1 5968.6 5976.3 5982.6 5989.1 5933.3 5958.6 6181.7 6204.3 6210.4 5649.2 5746.3 5758.9 5778.9 5780.8 5839.9 5848.8 5870.3 5871.1 5895.3 5469.4 5696.5 5709.7 5744.6 5781.2 5511.8 5541.5 5553.2 5587.4 5859.7 5490.0 5507.3 5510.6 5514.6 5516.6 5499.1 5571.1 5588.4 5744.0 5756.9 5587.9 5597.8 5632.0 5659.2 5711.9 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - PROCESS | 12497 | [#1] ext.html Cycles:180 Average:60000.81 Median:41402.98 stddev:125681.14 (303.6%) stddev-sans-first:125954.43 06:08:45 INFO - PROCESS | 12497 | Values: 547.2 581.2 598.8 604.8 646.1 38536.0 41837.0 41840.8 41879.4 42035.8 41790.0 42552.4 42608.0 42631.8 42723.0 8649.9 8825.6 8851.6 8855.1 8855.2 8803.9 8895.0 8905.5 8911.4 8919.3 8868.1 8920.9 8927.3 8958.4 8965.3 8820.8 8880.6 8930.8 8935.9 8939.3 8737.0 8747.2 8767.9 8813.3 8825.0 41005.8 41326.0 41545.4 41609.2 41842.6 2840.2 3244.0 3496.7 3515.6 4137.9 28786.1 29379.1 30852.4 32211.2 32640.8 4207.1 4216.2 4276.0 4291.6 4345.7 281710.0 284104.0 284883.0 285665.0 286830.0 33636.7 33646.0 33724.5 33743.3 33750.8 35534.5 36139.8 36456.3 37538.4 38105.8 17230.7 17278.9 17521.8 17524.1 17592.4 12511.8 12558.7 12565.2 12602.2 12603.3 19362.1 19506.9 19541.4 19583.8 19693.7 7196.9 7225.7 7332.5 7359.1 7380.4 970.1 1011.5 1028.2 1030.4 1082.3 32412.0 32454.1 32685.0 32945.2 33002.2 1060.1 1127.7 1148.7 1194.7 1225.4 16383.5 16823.6 16834.7 16967.9 17250.8 569302.0 570300.0 571684.0 574568.0 575403.0 40393.4 40448.0 40635.6 40709.6 40774.8 1322.3 1380.6 1381.4 1382.7 1387.5 31098.5 31668.2 32055.2 32069.2 32490.7 49605.5 50113.2 50222.5 50305.2 50553.2 497536.0 508186.0 511266.0 511468.0 512475.0 27208.0 27674.4 27956.4 28054.3 28136.0 47422.0 48062.8 48587.6 49024.5 50086.0 40093.8 41241.8 42289.6 42550.6 42947.1 41054.0 41694.8 41790.6 41965.8 42330.6 41377.6 41428.4 42484.4 43035.0 45738.3 41871.8 45442.5 46031.3 48454.8 48736.0 32743.2 33469.0 35123.6 35367.5 35516.8 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - PROCESS | 12497 | [#2] jquery.html Cycles:180 Average:28247.54 Median:2556.51 stddev:76558.66 (2994.7%) stddev-sans-first:76744.84 06:08:45 INFO - PROCESS | 12497 | Values: 382.6 382.9 383.4 385.9 397.3 18130.2 19812.7 19895.7 20401.6 20450.1 16141.9 16418.3 16483.1 17983.2 19926.0 5810.5 5862.9 5969.2 5985.4 6000.6 5646.7 5783.7 5814.4 5871.8 5876.1 5735.2 5770.5 5776.4 5787.5 5855.7 5697.5 5765.1 5780.0 5832.8 5845.8 4984.7 5129.1 5147.7 5314.4 5339.2 14077.0 14114.2 14132.2 21842.0 23001.0 2171.4 2222.9 2318.1 2380.3 2732.8 9535.8 10148.7 10274.2 10591.1 10611.8 1976.2 1994.6 2000.2 2002.3 2028.9 86143.0 88140.6 88546.0 88765.0 89103.0 10703.4 11117.2 11172.3 11233.6 11321.6 15256.3 15262.5 15422.2 15442.8 15468.0 7982.5 8531.1 8531.4 8565.6 8688.7 8304.7 8312.2 8337.7 8461.9 8464.3 4745.5 4756.4 4778.5 4888.7 4919.6 1951.0 1986.5 1991.5 2047.0 2052.1 914.7 937.9 975.3 991.6 1079.5 19745.9 20577.5 20590.9 20639.4 20688.1 986.2 1004.0 1018.9 1020.4 1038.0 10728.0 11335.5 11455.2 11547.7 11630.8 451304.0 453821.0 457060.0 469670.0 482211.0 72474.6 81846.6 92743.0 94963.0 97561.5 983.2 989.8 1011.2 1015.1 1023.5 16303.4 18165.9 18651.6 18685.6 18886.4 29862.7 31205.8 35237.6 37225.9 44196.3 59723.0 60123.7 60403.7 61567.4 61752.0 7593.4 8148.7 8781.3 8794.3 8890.2 13947.0 14308.4 14437.6 14538.8 14599.3 12532.7 12539.4 12640.9 12642.8 12790.9 12205.8 12306.3 12376.2 12450.0 12608.6 12112.7 12178.9 12229.6 12283.5 12299.2 7935.2 8143.0 8222.3 8364.2 8386.9 12136.6 12397.8 12480.4 12582.5 12590.4 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - PROCESS | 12497 | [#3] mootools.html Cycles:180 Average:5714.02 Median:4551.23 stddev:3250.61 (71.4%) stddev-sans-first:3243.83 06:08:45 INFO - PROCESS | 12497 | Values: 1435.4 1471.7 1577.6 1749.5 1766.6 7507.5 8215.0 8221.7 8710.7 8768.4 8417.0 8670.4 8679.8 8688.5 8701.0 2221.7 2255.8 2276.6 2281.0 2282.5 2197.6 2264.4 2265.1 2275.4 2281.1 2234.4 2240.5 2249.9 2257.0 2289.0 2199.7 2210.4 2217.7 2221.7 2231.7 2186.2 2192.9 2193.0 2194.6 2197.9 8737.0 8759.9 8770.9 8822.0 8831.7 4877.6 4945.1 4978.8 5004.7 5012.7 3376.7 3376.9 3419.9 3509.8 3523.4 1153.5 1158.7 1162.9 1164.8 1170.5 11882.0 11886.8 11904.3 11912.2 11918.0 4310.8 4320.2 4407.4 4549.6 4552.9 10154.1 10159.3 10184.4 10194.6 10221.6 5003.5 5026.2 5048.6 5054.7 5059.2 4058.9 4567.4 4585.2 4621.3 4709.1 3762.5 3855.1 3905.6 3961.7 3990.3 1243.4 1248.1 1249.1 1275.5 1281.3 845.2 902.9 953.9 958.4 976.6 5701.7 6130.9 6135.1 6154.1 6271.2 442.5 448.4 452.6 453.7 456.3 4262.8 4339.6 4347.2 4360.2 4376.0 10226.5 10585.9 10595.3 10718.7 10775.5 10147.1 10572.3 10626.3 10631.2 10678.9 7905.6 8121.0 8136.5 8144.8 8169.5 6080.4 6385.4 6393.4 6412.2 6420.7 10106.9 10180.5 10238.5 10252.4 10269.2 9956.7 9976.8 9998.1 10200.7 10271.7 6749.9 7112.5 7372.4 7463.5 7598.4 8481.8 8509.7 8510.7 8574.9 8603.8 7389.4 7628.0 7641.7 7648.0 7673.7 7397.3 7420.5 7462.0 7499.7 7588.1 7149.9 7179.1 7233.6 7238.0 7242.9 5208.6 5291.6 5389.4 5436.6 5439.5 5238.6 5327.8 5357.9 5495.4 5500.5 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - PROCESS | 12497 | [#4] prototype.html Cycles:180 Average:4879.03 Median:5530.92 stddev:1466.71 (26.5%) stddev-sans-first:1430.08 06:08:45 INFO - PROCESS | 12497 | Values: 305.1 312.9 313.3 314.5 325.7 5430.2 5564.3 5567.4 5602.2 5664.9 5548.1 5578.4 5579.3 5580.9 5583.6 4319.9 4324.6 4337.9 4339.7 4359.2 4026.8 4228.6 4232.8 4344.0 4359.6 4220.3 4232.7 4240.3 4249.4 4263.8 4250.2 4257.0 4264.6 4304.9 4308.4 3560.5 3755.8 3767.9 3768.6 3770.8 5445.0 5449.4 5449.4 5466.6 5501.5 4899.7 4918.5 4926.6 4930.9 4957.6 5572.5 5829.4 5831.5 5840.2 5850.4 4078.3 4087.8 4088.0 4088.5 4129.8 6048.0 6051.9 6063.9 6119.2 6133.4 4072.9 4165.1 4182.0 4184.6 4240.6 4229.5 4248.6 4259.3 4268.5 4272.4 4898.6 4927.9 4930.6 4944.8 4963.0 5674.2 5878.5 5930.7 5952.3 5972.6 1456.7 1481.5 1483.4 1487.8 1494.5 906.9 919.5 925.0 925.4 928.4 5008.3 5011.6 5042.6 5051.9 5067.3 5213.9 5238.3 5255.5 5315.8 5341.5 5057.4 5062.9 5080.2 5373.4 5848.7 3183.5 3215.5 3219.0 3220.5 3221.3 6136.9 6256.9 6281.5 6298.1 6305.9 6098.3 6106.8 6115.4 6128.8 6133.0 6142.4 6242.8 6278.5 6294.7 6345.8 5798.9 5906.6 5985.9 6040.3 6042.6 6003.4 6007.5 6014.0 6030.2 6043.4 6112.7 6226.4 6306.2 6308.8 6375.4 4175.8 4178.6 4193.4 4209.1 4218.6 6074.1 6138.9 6141.9 6156.2 6174.4 5756.3 5900.4 5906.7 5924.7 5939.8 5871.4 5886.2 5913.9 5914.3 5950.6 5513.8 5788.3 5796.5 5826.2 5890.3 5965.8 5971.8 5976.4 5988.2 5997.6 5757.2 5804.6 5830.9 5842.2 5931.4 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - PROCESS | 12497 | [#5] yui.html Cycles:180 Average:19782.11 Median:4958.44 stddev:27217.13 (548.9%) stddev-sans-first:27256.02 06:08:45 INFO - PROCESS | 12497 | Values: 764.2 788.8 792.6 797.1 871.3 15385.2 16115.4 16164.5 16172.0 16218.4 14439.7 14451.3 14544.3 14576.8 14607.2 796.5 816.2 816.3 817.3 817.6 659.0 773.5 807.5 810.6 813.5 863.2 870.7 873.7 874.9 877.8 870.1 872.1 872.8 873.2 873.9 630.7 630.8 632.5 633.2 635.7 15237.0 15245.0 15247.9 15255.7 15257.6 15778.6 15930.9 15966.4 16157.8 16162.5 12268.6 12370.1 12455.9 12478.2 12552.9 3959.8 3970.8 3989.4 3993.3 4140.3 75320.2 75689.6 76128.6 76417.0 77405.0 12082.5 12154.0 12288.5 12412.8 12521.8 22843.7 23094.2 23149.1 23218.9 23252.9 7887.7 8254.3 8367.3 8418.0 8743.4 4913.2 5003.7 5014.0 5024.4 5087.7 3483.6 3617.5 3621.8 3633.7 3635.2 636.1 638.8 640.6 658.5 664.3 625.8 650.2 701.5 708.4 726.8 9298.9 9362.7 9514.7 9793.8 10062.4 582.9 592.7 638.2 703.8 723.6 4393.0 4498.1 4521.5 4580.2 4597.8 71216.0 113717.4 113909.4 117326.0 118307.4 57534.0 75551.0 94329.0 95274.5 95376.0 52981.0 54400.2 74555.3 84821.0 88092.1 9004.8 9005.2 9061.1 9164.2 9412.8 50393.7 51228.2 52339.5 52365.5 52726.2 64252.7 65216.0 65303.7 66333.7 72328.0 13100.6 13496.4 13691.5 13835.7 13838.6 15336.7 15388.9 15541.4 15688.5 16245.4 14154.4 14470.9 14730.9 14747.0 15607.8 13883.9 13985.7 14309.9 14336.1 14630.3 14146.6 14426.4 14440.3 14677.0 14726.9 10824.9 11226.9 11275.4 11297.3 11502.4 10464.9 10893.3 11855.3 12091.2 12263.8 06:08:45 INFO - PROCESS | 12497 | -------- Summary: end -------- 06:08:45 INFO - PROCESS | 12497 | 06:08:45 INFO - TEST-INFO | 12497: exit 0 06:08:45 INFO - TEST-OK | dromaeo_css | took 1111852ms 06:08:45 INFO - TEST-START | kraken 06:08:45 INFO - operating with platform_type : linux_ 06:08:45 INFO - Initialising browser for kraken test... 06:08:45 INFO - TEST-INFO | started process 12747 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpLBFFwP/profile http://localhost:54488/getInfo.html) 06:08:50 INFO - PROCESS | 12747 | __metrics Screen width/height:1600/1200 06:08:50 INFO - PROCESS | 12747 | colorDepth:24 06:08:50 INFO - PROCESS | 12747 | Browser inner width/height: 1024/697 06:08:50 INFO - PROCESS | 12747 | __metrics 06:08:51 ERROR - PROCESS | 12747 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2957: TypeError: this.tabs is undefined 06:08:52 INFO - TEST-INFO | 12747: exit 0 06:08:52 INFO - Browser initialized. 06:08:52 INFO - Running cycle 1/1 for kraken test... 06:08:52 INFO - TEST-INFO | started process 12870 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpLBFFwP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:09:03 INFO - PROCESS | 12870 | RSS: Main: 167538688 06:09:03 INFO - PROCESS | 12870 | 06:09:06 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54488/tests/kraken/driver.html?testName=audio-beat-detection) 06:09:07 INFO - PROCESS | 12870 | RSS: Main: 172908544 06:09:07 INFO - PROCESS | 12870 | 06:09:09 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54488/tests/kraken/driver.html?testName=audio-dft) 06:09:10 INFO - PROCESS | 12870 | RSS: Main: 172703744 06:09:10 INFO - PROCESS | 12870 | 06:09:13 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54488/tests/kraken/driver.html?testName=audio-fft) 06:09:14 INFO - PROCESS | 12870 | RSS: Main: 166993920 06:09:14 INFO - PROCESS | 12870 | 06:09:16 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54488/tests/kraken/driver.html?testName=audio-oscillator) 06:09:16 INFO - PROCESS | 12870 | RSS: Main: 168214528 06:09:16 INFO - PROCESS | 12870 | 06:09:18 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54488/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:09:19 INFO - PROCESS | 12870 | RSS: Main: 168480768 06:09:19 INFO - PROCESS | 12870 | 06:09:22 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54488/tests/kraken/driver.html?testName=imaging-darkroom) 06:09:23 INFO - PROCESS | 12870 | RSS: Main: 168415232 06:09:23 INFO - PROCESS | 12870 | 06:09:26 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54488/tests/kraken/driver.html?testName=imaging-desaturate) 06:09:27 INFO - PROCESS | 12870 | RSS: Main: 166473728 06:09:27 INFO - PROCESS | 12870 | 06:09:30 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54488/tests/kraken/driver.html?testName=json-parse-financial) 06:09:30 INFO - PROCESS | 12870 | RSS: Main: 167424000 06:09:30 INFO - PROCESS | 12870 | 06:09:32 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54488/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:09:32 INFO - PROCESS | 12870 | RSS: Main: 168067072 06:09:32 INFO - PROCESS | 12870 | 06:09:34 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54488/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:09:35 INFO - PROCESS | 12870 | RSS: Main: 168488960 06:09:35 INFO - PROCESS | 12870 | 06:09:37 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54488/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:09:38 INFO - PROCESS | 12870 | RSS: Main: 168329216 06:09:38 INFO - PROCESS | 12870 | 06:09:40 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54488/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:09:41 INFO - PROCESS | 12870 | RSS: Main: 168390656 06:09:41 INFO - PROCESS | 12870 | 06:09:44 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54488/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:09:44 INFO - PROCESS | 12870 | RSS: Main: 168255488 06:09:44 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | Cycle 1(1): loaded http://localhost:54488/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54488/tests/kraken/driver.html?testName=ai-astar) 06:09:46 INFO - PROCESS | 12870 | RSS: Main: 169054208 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | __start_tp_report 06:09:46 INFO - PROCESS | 12870 | _x_x_mozilla_page_load 06:09:46 INFO - PROCESS | 12870 | _x_x_mozilla_page_load_details 06:09:46 INFO - PROCESS | 12870 | |i|pagename|runs| 06:09:46 INFO - PROCESS | 12870 | |0;ai-astar;104;113;106;113;112;113;114;113;112;114 06:09:46 INFO - PROCESS | 12870 | |1;audio-beat-detection;152;121;140;178;122;143;151;118;186;124 06:09:46 INFO - PROCESS | 12870 | |2;audio-dft;166;164;163;164;166;164;178;163;166;164 06:09:46 INFO - PROCESS | 12870 | |3;audio-fft;76;78;76;160;77;76;77;77;162;77 06:09:46 INFO - PROCESS | 12870 | |4;audio-oscillator;86;85;145;86;85;85;152;85;85;147 06:09:46 INFO - PROCESS | 12870 | |5;imaging-gaussian-blur;118;119;118;117;119;118;119;118;118;119 06:09:46 INFO - PROCESS | 12870 | |6;imaging-darkroom;149;147;148;148;147;148;147;148;147;149 06:09:46 INFO - PROCESS | 12870 | |7;imaging-desaturate;95;97;96;96;96;96;96;97;95;96 06:09:46 INFO - PROCESS | 12870 | |8;json-parse-financial;56;55;54;54;64;57;54;54;55;54 06:09:46 INFO - PROCESS | 12870 | |9;json-stringify-tinderbox;62;63;62;62;62;62;62;64;62;63 06:09:46 INFO - PROCESS | 12870 | |10;stanford-crypto-aes;77;76;79;76;79;84;76;78;82;77 06:09:46 INFO - PROCESS | 12870 | |11;stanford-crypto-ccm;133;128;146;136;122;121;123;128;169;127 06:09:46 INFO - PROCESS | 12870 | |12;stanford-crypto-pbkdf2;162;163;170;165;160;159;163;159;159;170 06:09:46 INFO - PROCESS | 12870 | |13;stanford-crypto-sha256-iterative;67;67;68;64;66;64;64;69;64;63 06:09:46 INFO - PROCESS | 12870 | __end_tp_report 06:09:46 INFO - PROCESS | 12870 | __start_cc_report 06:09:46 INFO - PROCESS | 12870 | _x_x_mozilla_cycle_collect,899 06:09:46 INFO - PROCESS | 12870 | __end_cc_report 06:09:46 INFO - PROCESS | 12870 | __startTimestamp1467983386749__endTimestamp 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | ------- Summary: start ------- 06:09:46 INFO - PROCESS | 12870 | Number of tests: 14 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#0] ai-astar Cycles:10 Average:111.40 Median:113.00 stddev:3.47 (3.1%) stddev-sans-first:2.44 06:09:46 INFO - PROCESS | 12870 | Values: 104.0 113.0 106.0 113.0 112.0 113.0 114.0 113.0 112.0 114.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#1] audio-beat-detection Cycles:10 Average:143.50 Median:147.00 stddev:23.89 (16.3%) stddev-sans-first:25.14 06:09:46 INFO - PROCESS | 12870 | Values: 152.0 121.0 140.0 178.0 122.0 143.0 151.0 118.0 186.0 124.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#2] audio-dft Cycles:10 Average:165.80 Median:165.00 stddev:4.44 (2.7%) stddev-sans-first:4.71 06:09:46 INFO - PROCESS | 12870 | Values: 166.0 164.0 163.0 164.0 166.0 164.0 178.0 163.0 166.0 164.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#3] audio-fft Cycles:10 Average:93.60 Median:77.00 stddev:35.53 (46.1%) stddev-sans-first:37.11 06:09:46 INFO - PROCESS | 12870 | Values: 76.0 78.0 76.0 160.0 77.0 76.0 77.0 77.0 162.0 77.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#4] audio-oscillator Cycles:10 Average:104.10 Median:85.00 stddev:30.34 (35.7%) stddev-sans-first:31.47 06:09:46 INFO - PROCESS | 12870 | Values: 86.0 85.0 145.0 86.0 85.0 85.0 152.0 85.0 85.0 147.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#5] imaging-gaussian-blur Cycles:10 Average:118.30 Median:118.50 stddev:0.67 (0.6%) stddev-sans-first:0.71 06:09:46 INFO - PROCESS | 12870 | Values: 118.0 119.0 118.0 117.0 119.0 118.0 119.0 118.0 118.0 119.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#6] imaging-darkroom Cycles:10 Average:147.80 Median:148.00 stddev:0.79 (0.5%) stddev-sans-first:0.71 06:09:46 INFO - PROCESS | 12870 | Values: 149.0 147.0 148.0 148.0 147.0 148.0 147.0 148.0 147.0 149.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.00 stddev:0.67 (0.7%) stddev-sans-first:0.60 06:09:46 INFO - PROCESS | 12870 | Values: 95.0 97.0 96.0 96.0 96.0 96.0 96.0 97.0 95.0 96.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#8] json-parse-financial Cycles:10 Average:55.70 Median:55.00 stddev:3.09 (5.6%) stddev-sans-first:3.28 06:09:46 INFO - PROCESS | 12870 | Values: 56.0 55.0 54.0 54.0 64.0 57.0 54.0 54.0 55.0 54.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#9] json-stringify-tinderbox Cycles:10 Average:62.40 Median:62.00 stddev:0.70 (1.1%) stddev-sans-first:0.73 06:09:46 INFO - PROCESS | 12870 | Values: 62.0 63.0 62.0 62.0 62.0 62.0 62.0 64.0 62.0 63.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#10] stanford-crypto-aes Cycles:10 Average:78.40 Median:78.50 stddev:2.72 (3.5%) stddev-sans-first:2.83 06:09:46 INFO - PROCESS | 12870 | Values: 77.0 76.0 79.0 76.0 79.0 84.0 76.0 78.0 82.0 77.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#11] stanford-crypto-ccm Cycles:10 Average:133.30 Median:130.50 stddev:14.62 (11.2%) stddev-sans-first:15.51 06:09:46 INFO - PROCESS | 12870 | Values: 133.0 128.0 146.0 136.0 122.0 121.0 123.0 128.0 169.0 127.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.00 Median:163.00 stddev:4.22 (2.6%) stddev-sans-first:4.46 06:09:46 INFO - PROCESS | 12870 | Values: 162.0 163.0 170.0 165.0 160.0 159.0 163.0 159.0 159.0 170.0 06:09:46 INFO - PROCESS | 12870 | 06:09:46 INFO - PROCESS | 12870 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.60 Median:66.50 stddev:2.07 (3.1%) stddev-sans-first:2.13 06:09:46 INFO - PROCESS | 12870 | Values: 67.0 67.0 68.0 64.0 66.0 64.0 64.0 69.0 64.0 63.0 06:09:46 INFO - PROCESS | 12870 | -------- Summary: end -------- 06:09:46 INFO - PROCESS | 12870 | 06:09:47 INFO - TEST-INFO | 12870: exit 0 06:09:47 INFO - TEST-OK | kraken | took 61748ms 06:09:47 INFO - SUITE-END | took 1173s 06:09:47 INFO - Completed test suite (00:19:33) 06:09:47 INFO - javascript benchmark 06:09:47 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7258.095066453112, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3029.818210907346, 3091.3817236552686, 3099.3646302507973, 3115.5949726535546, 3122.422351864905, 5371.871906899551, 5473.15166149247, 5475.6440831345935, 5518.586106042053, 5552.08390615549, 5342.492463215988, 5473.972630136844, 5507.284053073105, 5510.972445137779, 5534.667919924807, 4799.400074990626, 4970.428400733907, 4981.252812078181, 5021.347224860763, 5083.79664813407, 4935.703857768527, 5125.718085505296, 5130.127878260686, 5138.922916156242, 5148.510891465324, 4872.123017856784, 4909.3126962225315, 4930.457649658535, 5047.64666473347, 5056.089903817311, 4937.901241975176, 4942.777575009133, 4943.0, 4945.554900059012, 5003.099442100421, 4828.324034635154, 4873.610111191097, 4901.509849015106, 4912.557869791736, 4931.67944083637, 5296.496832800916, 5418.729063546846, 5453.972730136364, 5515.365732940723, 5539.25220095286, 5896.734646940898, 5915.881682366328, 5918.201042859202, 5920.259967504062, 5922.763089476416, 5784.595078344518, 5926.881462370771, 5926.940730592682, 5927.525797936155, 5944.583879128462, 5435.347758268994, 5439.211314359396, 5488.368837583689, 5499.615026948075, 5508.14623733318, 5989.9101513477335, 5990.460858522667, 5990.7903223386975, 5997.190379298826, 6022.488088512438, 5647.745851436613, 5685.744141513642, 5793.420657934257, 5808.419158084158, 5811.070228763462, 5834.0, 5846.853828654318, 5846.912296315559, 5848.2689663792025, 5899.646021238739, 5671.943280567224, 5780.913286300709, 5803.709814509258, 5813.069908814569, 5871.0, 5611.382747897728, 5631.4087020863035, 5851.678157701367, 5880.970595146997, 5888.263967004124, 4361.629261512807, 4374.737515749065, 4395.824167033346, 4433.224185767478, 4468.128714900628, 3908.511436070491, 3924.0778417071965, 3930.390789427643, 3956.584558621303, 3956.9010774730864, 5554.472325129106, 5602.831915042555, 5635.323761148688, 5642.71786410686, 5658.74535645897, 5769.163471296639, 5800.274965629296, 5855.853603659943, 5856.648601083949, 5860.238169037998, 5612.214289999403, 5658.434156584309, 5670.8015219467125, 5671.9716401418555, 5676.035074037423, 4890.95109048912, 4988.551030407209, 5044.394672639307, 5044.697318160922, 5050.393952725696, 6095.451409373178, 6117.063650123445, 6129.267100814801, 6182.567220294536, 6186.876262474815, 5946.108083787466, 5968.612040217372, 5976.252968378953, 5982.551308651781, 5989.0716938873675, 5933.347331793413, 5958.612690175125, 6181.690915454299, 6204.317525072329, 6210.378962103934, 5649.152627105967, 5746.281714785652, 5758.884822303614, 5778.8844223114465, 5780.826575202751, 5839.912401313899, 5848.824535263949, 5870.295564532284, 5871.089981052944, 5895.29256489224, 5469.3983661797965, 5696.458836410535, 5709.714514274353, 5744.62129089024, 5781.161731548817, 5511.8149597836655, 5541.473560011793, 5553.194786755817, 5587.357453892691, 5859.677717725395, 5489.972550137224, 5507.311586051744, 5510.614257001971, 5514.61397702157, 5516.613837031369, 5499.092649712753, 5571.1086226203615, 5588.441155884379, 5744.023516002206, 5756.856078598069, 5587.944120558743, 5597.80407685729, 5632.042552765957, 5659.179418984307, 5711.885762284648], "value": 5384.053982361993, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [547.1892026336412, 581.2356750872602, 598.7575032111994, 604.7732100462327, 646.0857886091181, 38536.0, 41837.0, 41840.79079604598, 41879.371809422846, 42035.78982105093, 41790.0, 42552.361714574305, 42608.0, 42631.78684106583, 42723.0, 8649.870251946226, 8825.602847871829, 8851.645934162625, 8855.114488551159, 8855.24730397917, 8803.911960880374, 8894.955525222365, 8905.465672059665, 8911.420757650765, 8919.286457083417, 8868.113188681145, 8920.866187007168, 8927.330450216226, 8958.417702849294, 8965.282777377826, 8820.779480513007, 8880.600372983232, 8930.776730581723, 8935.910640893573, 8939.32955028369, 8736.956315218384, 8747.212750852454, 8767.912320876838, 8813.338999575057, 8824.955875220647, 41005.79497102525, 41326.0, 41545.37681934774, 41609.167816643494, 41842.58157418417, 2840.182283338665, 3243.9837800811083, 3496.667816557423, 3515.59570649376, 4137.937930931039, 28786.136415907557, 29379.118626441243, 30852.382952340828, 32211.19472013195, 32640.836795816107, 4207.056708367656, 4216.198922204771, 4276.001938187805, 4291.635211007068, 4345.69580129391, 281710.0, 284104.0, 284883.0, 285665.0, 286829.9999999979, 33636.66363336335, 33646.0, 33724.49413258803, 33743.325133497194, 33750.83124584361, 35534.466982995276, 36139.81930090333, 36456.27087458289, 37538.43692344617, 38105.80947095247, 17230.655386892442, 17278.91360543189, 17521.824781752275, 17524.123793810515, 17592.384266550864, 12511.812322815165, 12558.74882502345, 12565.246085234916, 12602.180858244184, 12603.306818125091, 19362.12193111705, 19506.891210231526, 19541.413757587296, 19583.77481457791, 19693.704594431096, 7196.856062878713, 7225.674844631899, 7332.523385979895, 7359.1169059713175, 7380.409567234608, 970.0832713086207, 1011.4740335025892, 1028.2339656955617, 1030.3674112642123, 1082.3181395720646, 32412.0, 32454.09348689625, 32685.0, 32945.176370590925, 33002.17494562655, 1060.1042119409087, 1127.6842484104463, 1148.7128217945515, 1194.7002021109329, 1225.3689349984766, 16383.508494745176, 16823.600145091015, 16834.747478787827, 16967.91516042412, 17250.827491724922, 569302.0, 570300.0, 571684.0, 574568.0, 575403.0, 40393.39409908854, 40448.0, 40635.59364406318, 40709.59290407058, 40774.79612601918, 1322.3256139368991, 1380.5513208207374, 1381.3990913952464, 1382.6819831438825, 1387.4727603510803, 31098.53352199764, 31668.208294792814, 32055.198620034687, 32069.198270042503, 32490.675093248767, 49605.50394496009, 50113.24830127624, 50222.49777502324, 50305.24542131944, 50553.24170137524, 497536.0, 508186.0, 511266.0, 511468.0, 512475.0, 27208.0, 27674.44651107007, 27956.44087118287, 28054.2986425341, 28136.0, 47422.0, 48062.759686201345, 48587.570621468076, 49024.50975490199, 50086.0, 40093.79953100216, 41241.76274711763, 42289.57710422856, 42550.57449425466, 42947.14105717931, 41054.0, 41694.79152604217, 41790.582094178666, 41965.790171048946, 42330.576694232666, 41377.586224137376, 41428.378574322014, 42484.36273455839, 43035.0, 45738.31392529048, 41871.796021461596, 45442.45575442429, 46031.309530356404, 48454.757726211144, 48736.0, 32743.18142046468, 33469.0, 35123.64876351306, 35367.46948795718, 35516.82241588776], "value": 19578.700547332108, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [382.6250274730764, 382.8985318890494, 383.4105754123145, 385.9112404147046, 397.2749731739576, 18130.18414171362, 19812.702809457835, 19895.701564476527, 20401.59196816063, 20450.07974641141, 16141.919290403532, 16418.26117824698, 16483.093429861354, 17983.19075641596, 19926.0, 5810.506106980901, 5862.853428664275, 5969.22400087988, 5985.431384018511, 6000.609960352563, 5646.717664116798, 5783.6529808211435, 5814.4185581441725, 5871.794487192949, 5876.11858221266, 5735.168400581913, 5770.480656740892, 5776.393478684719, 5787.450192231731, 5855.707214639251, 5697.487226149646, 5765.077587585966, 5780.046292361755, 5832.766689332421, 5845.766169353221, 4984.700917944935, 5129.0767661820855, 5147.716875571842, 5314.362276526803, 5339.172428273624, 14077.014608977375, 14114.153150810882, 14132.22272774997, 21842.0, 23001.0, 2171.3811563704426, 2222.8777417242045, 2318.14228735369, 2380.262118743195, 2732.7540521352976, 9535.761605959837, 10148.746281342952, 10274.178065754722, 10591.099756520705, 10611.78776424475, 1976.2391479280436, 1994.5611965367596, 2000.1899230811543, 2002.3292197113985, 2028.868123571963, 86143.0, 88140.5592972031, 88546.0, 88765.0, 89103.0, 10703.357798532114, 11117.22179447431, 11172.329660220414, 11233.606823761129, 11321.584801899762, 15256.313465894062, 15262.465813696468, 15422.151781652117, 15442.768358474632, 15468.0, 7982.481138726081, 8531.10423405546, 8531.402801803939, 8565.571721413904, 8688.6524539019, 8304.70933517324, 8312.21034001769, 8337.708180213664, 8461.873071903927, 8464.322854171774, 4745.477997420281, 4756.381670382828, 4778.4982576829625, 4888.706677599355, 4919.557239848359, 1951.0, 1986.4636548132212, 1991.4878347802605, 2046.9897650511653, 2052.127845665586, 914.6661468564059, 937.8827646544182, 975.3465178330536, 991.5785791038779, 1079.5465904320204, 19745.901270493556, 20577.485562860747, 20590.897045514677, 20639.380818575468, 20688.069036893376, 986.2455221755363, 1003.9949800250952, 1018.9286749927583, 1020.3724709303725, 1037.9532921018572, 10728.0, 11335.489902954387, 11455.198136130392, 11547.653570392902, 11630.76738465226, 451304.0, 453821.0, 457060.0, 469670.0, 482211.0, 72474.63762681259, 81846.59076704698, 92743.0, 94963.0, 97561.51219244, 983.1839573154265, 989.8218320702342, 1011.1809434358194, 1015.0559979219397, 1023.5394072667478, 16303.429379971643, 18165.909170454062, 18651.626967460303, 18685.626287473904, 18886.43340699781, 29862.70137298686, 31205.843970780003, 35237.64762352344, 37225.88322350334, 44196.33705494356, 59723.0, 60123.69938150281, 60403.69798150981, 61567.38432615796, 61752.0, 7593.430492712958, 8148.714794982147, 8781.29749620016, 8794.29645628361, 8890.244329232088, 13947.0, 14308.427662893784, 14437.639059023608, 14538.781918271447, 14599.343029563483, 12532.686682833002, 12539.37303134858, 12640.936795315965, 12642.810357844824, 12790.936045319713, 12205.816912746139, 12306.323152226714, 12376.195547289397, 12450.0, 12608.621741347773, 12112.697182570153, 12178.878211217774, 12229.571964981184, 12283.508659653513, 12299.200551964093, 7935.2064793522495, 8142.959285203536, 8222.342212623096, 8364.159884825329, 8386.874196886929, 12136.575219867615, 12397.75204495923, 12480.375981201085, 12582.496700131893, 12590.370481476073], "value": 9249.63438057878, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1435.3756116089505, 1471.7056588682262, 1577.6134846962495, 1749.4664127441142, 1766.6378392429554, 7507.549547027183, 8214.958925205381, 8221.712240071598, 8710.695125670594, 8768.386212965095, 8417.0, 8670.43642163259, 8679.783005424868, 8688.478691278528, 8700.956495217531, 2221.7000704904794, 2255.796978271955, 2276.567452184088, 2281.0305620111385, 2282.47503074293, 2197.571473562656, 2264.388615073929, 2265.105283413051, 2275.3856458756127, 2281.087564974007, 2234.3632064861517, 2240.484688521641, 2249.9425270123015, 2257.0, 2288.9542209155807, 2199.7250343707037, 2210.403191138392, 2217.73387193537, 2221.6556433752635, 2231.7098777159026, 2186.2348178137686, 2192.9451763705874, 2192.9780702192934, 2194.572058448603, 2197.8791166486, 8737.038925718229, 8759.868601970975, 8770.912290877073, 8822.0, 8831.735047948507, 4877.6341774367065, 4945.109880221558, 4978.8050867791835, 5004.699718016931, 5012.72430016349, 3376.679215474526, 3376.864925402981, 3419.9316013679836, 3509.8069606171653, 3523.365794157051, 1153.532819208222, 1158.6755708401577, 1162.9476673549711, 1164.825276208567, 1170.4732870208354, 11882.0, 11886.762264754743, 11904.345261010641, 11912.166148369532, 11918.046556275478, 4310.849120280775, 4320.243957307459, 4407.382966384709, 4549.5905368517, 4552.863414097583, 10154.086132248132, 10159.339642923334, 10184.439855807854, 10194.643187488402, 10221.642242521477, 5003.4746351633285, 5026.246063090565, 5048.570871475892, 5054.721990290569, 5059.241113832881, 4058.857939972087, 4567.36056952027, 4585.151746926829, 4621.2837010263465, 4709.0817290628, 3762.529683789526, 3855.1133239355104, 3905.6094390560716, 3961.6830653547645, 3990.3016972029777, 1243.3783108445778, 1248.1450206608502, 1249.1256120715354, 1275.5153041844226, 1281.2708929979085, 845.2139510255398, 902.8916530016309, 953.8616900549521, 958.4266245131844, 976.6093562575027, 5701.71491425427, 6130.938690613126, 6135.141080248769, 6154.107654390178, 6271.216097987752, 442.4690371554148, 448.428253976183, 452.58362306677935, 453.66202179376575, 456.26769035697225, 4262.786860656955, 4339.5660433956355, 4347.217500849877, 4360.193364227628, 4376.0, 10226.53980570876, 10585.89414105849, 10595.258331916692, 10718.73203169927, 10775.515101820436, 10147.086762191439, 10572.259941803999, 10626.256162068736, 10631.202659800545, 10678.946605266923, 7905.604719764104, 8121.0, 8136.511809291462, 8144.796380090426, 8169.4689845161065, 6080.391960803884, 6385.361463853763, 6393.424591786761, 6412.23053233615, 6420.711068002044, 10106.949465252626, 10180.541875615467, 10238.488075596042, 10252.43611601369, 10269.229807764297, 9956.651517196864, 9976.800463990825, 9998.100170984646, 10200.744981375228, 10271.7432064199, 6749.898751518633, 7112.50212485121, 7372.373348265243, 7463.477556570988, 7598.35413989795, 8481.787955301166, 8509.702160424355, 8510.70212542558, 8574.871376929226, 8603.784905377415, 7389.371903388273, 7627.961860190663, 7641.6561254742555, 7648.0, 7673.6546855390525, 7397.26027397256, 7420.5176663516695, 7462.0, 7499.737509187153, 7588.127365353055, 7149.892751608626, 7179.066721326194, 7233.602151881697, 7237.963810180915, 7242.89135662955, 5208.609354298367, 5291.550218231493, 5389.434109418611, 5436.6194366393975, 5439.48324909133, 5238.580913526985, 5327.760250788646, 5357.866053348697, 5495.422980587141, 5500.50495455411], "value": 4496.0530789324, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [305.12885711294257, 312.8889244318267, 313.33260155868, 314.529777981917, 325.682459601888, 5430.239766432703, 5564.276644036269, 5567.443255674436, 5602.187682785993, 5664.886702265957, 5548.056830338842, 5578.429804924841, 5579.326202139362, 5580.91628625571, 5583.553315734742, 4319.892002699926, 4324.589164029412, 4337.93493097603, 4339.674524410666, 4359.215341238576, 4026.778527181004, 4228.640565551932, 4232.788360581959, 4344.0, 4359.629431498326, 4220.324748040314, 4232.661387089025, 4240.342746874239, 4249.426327445786, 4263.846757387515, 4250.213710463574, 4257.0, 4264.552222016706, 4304.870853874389, 4308.375285583604, 3560.5193298904574, 3755.8122093895195, 3767.9058023549355, 3768.566614839274, 3770.811459427018, 5444.992676354847, 5449.373322067973, 5449.427810079924, 5466.644668096561, 5501.5323697485765, 4899.657024008321, 4918.483559226265, 4926.556609905126, 4930.901381972376, 4957.578605818474, 5572.5263352615075, 5829.446202610745, 5831.475167234969, 5840.218733286346, 5850.3564607893095, 4078.3066878630702, 4087.7532352632434, 4088.0, 4088.5093788745244, 4129.772862492562, 6048.0, 6051.878962420727, 6063.939360606426, 6119.204503414572, 6133.355997620275, 4072.8778136655947, 4165.125323682, 4181.975416023094, 4184.581541845791, 4240.575942405796, 4229.450171477688, 4248.596383343577, 4259.339802330644, 4268.530461649216, 4272.444582204355, 4898.608111351084, 4927.90144197114, 4930.556249937523, 4944.777485013183, 4962.950370496321, 5674.177244299553, 5878.5297176225795, 5930.703464826742, 5952.3154837193415, 5972.611780234358, 1456.6722487440454, 1481.451862810767, 1483.3769816677022, 1487.7619580867226, 1494.4993427201791, 906.9138431848963, 919.4529255093208, 924.9778994211434, 925.4169872979979, 928.4197376639601, 5008.273800298936, 5011.57401620859, 5042.588075338837, 5051.852962490927, 5067.315912351859, 5213.921791173136, 5238.319018527567, 5255.527002569711, 5315.840524784263, 5341.519263266325, 5057.367829021372, 5062.949370506248, 5080.187170052774, 5373.35519737634, 5848.707564621752, 3183.5224716292278, 3215.5176723491663, 3218.9678103218666, 3220.4686226772787, 3221.275213077086, 6136.9079463808075, 6256.874862502725, 6281.466075383552, 6298.149749783812, 6305.873882522324, 6098.268207815002, 6106.786262480792, 6115.449609535163, 6128.754849806047, 6132.969335153296, 6142.416470435391, 6242.75028998844, 6278.46633036197, 6294.653794041372, 6345.809625711236, 5798.855028624318, 5906.616069955439, 5985.880282394415, 6040.335563087969, 6042.579993701389, 6003.429674180946, 6007.459328660441, 6013.9699301503215, 6030.246219222598, 6043.395660434097, 6112.72492737819, 6226.40849119333, 6306.211723534559, 6308.791922826974, 6375.4262116409745, 4175.832966681299, 4178.603032711888, 4193.433886425293, 4209.137126888919, 4218.599233072853, 6074.119252708421, 6138.8643101026455, 6141.938580614136, 6156.199694039925, 6174.38256174379, 5756.280464941882, 5900.380460051804, 5906.70466476683, 5924.659759395101, 5939.821805345847, 5871.412858714094, 5886.175935369138, 5913.881722365614, 5914.290285165807, 5950.601608622057, 5513.779448822002, 5788.321386797781, 5796.507296879812, 5826.155207494805, 5890.263717035371, 5965.761369545343, 5971.7611295547695, 5976.372480889444, 5988.161657367885, 5997.590566216848, 5757.165211044459, 5804.564657650609, 5830.854228644148, 5842.152887831326, 5931.436513531207], "value": 4398.61674049757, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [764.2204950950031, 788.7515432638719, 792.5918550233993, 797.0744085379505, 871.2507243770357, 15385.230738463088, 16115.435959741411, 16164.515064548068, 16172.0296782193, 16218.432354867553, 14439.711205775879, 14451.349689263981, 14544.345504452298, 14576.781348279757, 14607.196604186765, 796.5300472721079, 816.1593558634615, 816.322452364536, 817.3093735793245, 817.6075483767795, 658.9934100659004, 773.5358784729174, 807.5114555693809, 810.5541951926417, 813.4631143445328, 863.197226579281, 870.6647940542873, 873.7422460374173, 874.8950125984859, 877.7893305606673, 870.11683141611, 872.0538216035577, 872.764353624521, 873.205383101381, 873.8995015573227, 630.7350912616712, 630.7540059376847, 632.4782054804805, 633.2021652717563, 635.6726285962686, 15237.0, 15245.0, 15247.923760381127, 15255.694886102216, 15257.61855953599, 15778.605534861605, 15930.920345398315, 15966.361345546164, 16157.757633635387, 16162.515124546166, 12268.570600029045, 12370.13409061357, 12455.875441245653, 12478.18891772041, 12552.937235313764, 3959.762414255154, 3970.82131304092, 3989.3617021276455, 3993.341098718708, 4140.254754144253, 75320.24679753187, 75689.62155189244, 76128.61935690285, 76417.0, 77405.0, 12082.516699332104, 12154.0, 12288.508459661514, 12412.751744965231, 12521.812172817416, 22843.657345139836, 23094.191703290304, 23149.07403703833, 23218.883905580366, 23252.883735581214, 7887.723929662434, 8254.339652827759, 8367.330613550901, 8418.0, 8743.387962842668, 4913.21388577833, 5003.674761140514, 5013.974930125326, 5024.447310795809, 5087.669301495391, 3483.634218407031, 3617.511635929116, 3621.8370173341737, 3633.691136253448, 3635.2002559436883, 636.0872148466965, 638.8019713888709, 640.5516138702926, 658.4567731621431, 664.2792570061441, 625.7934881489098, 650.177525430331, 701.4949236549676, 708.4049398505177, 726.8146622611306, 9298.907010929805, 9362.672306469241, 9514.666986655433, 9793.755156121155, 10062.39625622465, 582.9186858377649, 592.6740292838921, 638.1735652330243, 703.7923812475332, 723.6381809095452, 4392.9676526016365, 4498.145352383102, 4521.465770663687, 4580.24425969718, 4597.793099310539, 71216.0, 113717.4314128424, 113909.43045284886, 117326.0, 118307.40846295886, 57534.0, 75551.0, 94329.0, 95274.52362738142, 95376.0, 52981.0, 54400.18399724007, 74555.25444745591, 84821.0, 88092.11907881095, 9004.762849771883, 9005.189532942066, 9061.13919177677, 9164.175224229852, 9412.811743765224, 50393.74015649638, 51228.231576525635, 52339.47660523346, 52365.47634523606, 52726.20910686266, 64252.678736607886, 65216.0, 65303.673481632286, 66333.66833165803, 72328.0, 13100.60698179056, 13496.392662330023, 13691.45234190661, 13835.654108647364, 13838.584842454742, 15336.69326613439, 15388.923055384652, 15541.37834486653, 15688.529344119695, 16245.431409900597, 14154.433822646979, 14470.927645361706, 14730.926345368205, 14747.041442306216, 15607.765883511529, 13883.861161388257, 13985.720285594027, 14309.856901430852, 14336.068155569854, 14630.341634626255, 14146.646333841736, 14426.42294308216, 14440.277986100864, 14677.045992010486, 14726.926365368105, 10824.891751082389, 11226.887731122584, 11275.379854108103, 11297.322160670386, 11502.367369794407, 10464.895351046393, 10893.346399216072, 11855.288682679067, 12091.214071085351, 12263.75472490563], "value": 7581.011202918359, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1538.9, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 113.0, 106.0, 113.0, 112.0, 113.0, 114.0, 113.0, 112.0, 114.0], "value": 111.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 121.0, 140.0, 178.0, 122.0, 143.0, 151.0, 118.0, 186.0, 124.0], "value": 143.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 164.0, 163.0, 164.0, 166.0, 164.0, 178.0, 163.0, 166.0, 164.0], "value": 165.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 78.0, 76.0, 160.0, 77.0, 76.0, 77.0, 77.0, 162.0, 77.0], "value": 93.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 85.0, 145.0, 86.0, 85.0, 85.0, 152.0, 85.0, 85.0, 147.0], "value": 104.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 119.0, 118.0, 117.0, 119.0, 118.0, 119.0, 118.0, 118.0, 119.0], "value": 118.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 147.0, 148.0, 148.0, 147.0, 148.0, 147.0, 148.0, 147.0, 149.0], "value": 147.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 97.0, 96.0, 96.0, 96.0, 96.0, 96.0, 97.0, 95.0, 96.0], "value": 96.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 55.0, 54.0, 54.0, 64.0, 57.0, 54.0, 54.0, 55.0, 54.0], "value": 55.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 63.0, 62.0, 62.0, 62.0, 62.0, 62.0, 64.0, 62.0, 63.0], "value": 62.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 76.0, 79.0, 76.0, 79.0, 84.0, 76.0, 78.0, 82.0, 77.0], "value": 78.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 128.0, 146.0, 136.0, 122.0, 121.0, 123.0, 128.0, 169.0, 127.0], "value": 133.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 170.0, 165.0, 160.0, 159.0, 163.0, 159.0, 159.0, 170.0], "value": 163.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 67.0, 68.0, 64.0, 66.0, 64.0, 64.0, 69.0, 64.0, 63.0], "value": 65.6, "unit": "score"}]}]} 06:09:48 INFO - Return code: 0 06:09:48 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:09:48 ERROR - # TBPL SUCCESS # 06:09:48 INFO - Running post-action listener: _resource_record_post_action 06:09:48 INFO - ##### 06:09:48 INFO - ##### Finished run-tests step (success) 06:09:48 INFO - ##### 06:09:48 INFO - Running post-run listener: _resource_record_post_run 06:09:48 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 8192; Write bytes: 553308160; Read time: 192; Write time: 595040 06:09:48 INFO - TinderboxPrint: CPU usage
13.4% 06:09:48 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 192 06:09:48 INFO - TinderboxPrint: I/O write bytes / time
553,308,160 / 595,040 06:09:48 INFO - TinderboxPrint: CPU idle
8,229.4 (86.6%) 06:09:48 INFO - TinderboxPrint: CPU user
1,213.6 (12.8%) 06:09:48 INFO - TinderboxPrint: Swap in / out
0 / 0 06:09:48 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 256962560; Read time: 0; Write time: 344624 06:09:48 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 4096; Write bytes: 296345600; Read time: 184; Write time: 250416 06:09:48 INFO - Running post-run listener: _upload_blobber_files 06:09:48 INFO - Blob upload gear active. 06:09:48 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:09:48 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 06:09:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:09:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:09:49 INFO - (blobuploader) - INFO - Open directory for files ... 06:09:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:09:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:09:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:09:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:09:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:09:49 INFO - (blobuploader) - INFO - Done attempting. 06:09:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:09:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:09:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:09:53 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:09:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:09:53 INFO - (blobuploader) - INFO - Done attempting. 06:09:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:09:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:09:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:09:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:09:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:09:54 INFO - (blobuploader) - INFO - Done attempting. 06:09:54 INFO - (blobuploader) - INFO - Iteration through files over. 06:09:54 INFO - Return code: 0 06:09:54 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:09:54 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:09:54 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f8a044ef08f4496793def92277a70283f67c7fe8b76e94e5bb1a320dd64f1d4457f4f86a71e4b075929829ca5947d8ff74c247ad7b2b7e2ff19104b0fb2aff3e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/59d693254535537a26f4f5984a9ddafc4c7c1db8f9567fe01865f181a2b463ae83495a7980e7407b08bac4909da3ec31e6122d78ba2177b7cdea2863f5a34caa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9059cef6d80856f0966bda719b6794c47ed6f55356fbec011daa9068e585522cd68425c6b096213468f0e3435e06e2a247bc9c2327ce05d72e6e018a96882fcc"} 06:09:54 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:09:54 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:09:54 INFO - Contents: 06:09:54 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f8a044ef08f4496793def92277a70283f67c7fe8b76e94e5bb1a320dd64f1d4457f4f86a71e4b075929829ca5947d8ff74c247ad7b2b7e2ff19104b0fb2aff3e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/59d693254535537a26f4f5984a9ddafc4c7c1db8f9567fe01865f181a2b463ae83495a7980e7407b08bac4909da3ec31e6122d78ba2177b7cdea2863f5a34caa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9059cef6d80856f0966bda719b6794c47ed6f55356fbec011daa9068e585522cd68425c6b096213468f0e3435e06e2a247bc9c2327ce05d72e6e018a96882fcc"} 06:09:54 INFO - Running post-run listener: copy_logs_to_upload_dir 06:09:54 INFO - Copying logs to upload dir... 06:09:54 INFO - mkdir: /builds/slave/test/build/upload/logs 06:09:54 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1232.003447 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-07-08 06:09:53.483604) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-08 06:09:53.486929) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f8a044ef08f4496793def92277a70283f67c7fe8b76e94e5bb1a320dd64f1d4457f4f86a71e4b075929829ca5947d8ff74c247ad7b2b7e2ff19104b0fb2aff3e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/59d693254535537a26f4f5984a9ddafc4c7c1db8f9567fe01865f181a2b463ae83495a7980e7407b08bac4909da3ec31e6122d78ba2177b7cdea2863f5a34caa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9059cef6d80856f0966bda719b6794c47ed6f55356fbec011daa9068e585522cd68425c6b096213468f0e3435e06e2a247bc9c2327ce05d72e6e018a96882fcc"} build_url:https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011336 build_url: 'https://queue.taskcluster.net/v1/task/WZYUvIaIQ4mF3GQJABPKng/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f8a044ef08f4496793def92277a70283f67c7fe8b76e94e5bb1a320dd64f1d4457f4f86a71e4b075929829ca5947d8ff74c247ad7b2b7e2ff19104b0fb2aff3e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/59d693254535537a26f4f5984a9ddafc4c7c1db8f9567fe01865f181a2b463ae83495a7980e7407b08bac4909da3ec31e6122d78ba2177b7cdea2863f5a34caa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9059cef6d80856f0966bda719b6794c47ed6f55356fbec011daa9068e585522cd68425c6b096213468f0e3435e06e2a247bc9c2327ce05d72e6e018a96882fcc"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-08 06:09:53.512429) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-08 06:09:53.512837) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1467982161.136386-1839797164 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004455 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-08 06:09:53.598740) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-08 06:09:53.599156) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-08 06:09:53.599570) ========= ========= Total master_lag: 0.16 =========