builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-002 starttime: 1462190742.39 results: success (0) buildid: 20160502023014 builduid: 5f38379620f34e8f91e075b0e0fb2a27 revision: 33b4d01f08e4b89e172be41517a65586b4e59699 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.394544) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.395060) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.395604) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.430436) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.430774) ========= 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=a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-02 05:05:42-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 60.1M=0s 2016-05-02 05:05:42 (60.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.097853 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.540792) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.541116) ========= 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=a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020826 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.590883) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:42.591257) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 33b4d01f08e4b89e172be41517a65586b4e59699 --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 33b4d01f08e4b89e172be41517a65586b4e59699 --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=a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-02 05:05:42,740 truncating revision to first 12 chars 2016-05-02 05:05:42,740 Setting DEBUG logging. 2016-05-02 05:05:42,740 attempt 1/10 2016-05-02 05:05:42,740 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/33b4d01f08e4?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-02 05:05:42,996 unpacking tar archive at: fx-team-33b4d01f08e4/testing/mozharness/ program finished with exit code 0 elapsedTime=0.542342 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:43.146514) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:43.146839) ========= script_repo_revision: 33b4d01f08e4b89e172be41517a65586b4e59699 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:43.147506) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:43.147770) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-02 05:05:43.158022) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 35 mins, 21 secs) (at 2016-05-02 05:05:43.158436) ========= /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=a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:05:43 INFO - MultiFileLogger online at 20160502 05:05:43 in /builds/slave/test 05:05:43 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:05:43 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:05:43 INFO - {'append_to_log': False, 05:05:43 INFO - 'base_work_dir': '/builds/slave/test', 05:05:43 INFO - 'blob_upload_branch': 'Fx-Team', 05:05:43 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:05:43 INFO - 'branch': 'Fx-Team', 05:05:43 INFO - 'buildbot_json_path': 'buildprops.json', 05:05:43 INFO - 'config_files': ('talos/linux_config.py',), 05:05:43 INFO - 'default_actions': ('clobber', 05:05:43 INFO - 'read-buildbot-config', 05:05:43 INFO - 'download-and-extract', 05:05:43 INFO - 'populate-webroot', 05:05:43 INFO - 'create-virtualenv', 05:05:43 INFO - 'install', 05:05:43 INFO - 'run-tests'), 05:05:43 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:05:43 INFO - 'download_minidump_stackwalk': True, 05:05:43 INFO - 'download_symbols': 'ondemand', 05:05:43 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:05:43 INFO - 'tooltool.py': '/tools/tooltool.py', 05:05:43 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:05:43 INFO - '/tools/misc-python/virtualenv.py')}, 05:05:43 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:05:43 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:05:43 INFO - 'installer_path': 'installer.exe', 05:05:43 INFO - 'log_level': 'info', 05:05:43 INFO - 'log_name': 'talos', 05:05:43 INFO - 'log_to_console': True, 05:05:43 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:05:43 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:05:43 INFO - 'opt_config_files': (), 05:05:43 INFO - 'pip_index': False, 05:05:43 INFO - 'sps_profile': False, 05:05:43 INFO - 'sps_profile_interval': 0, 05:05:43 INFO - 'suite': 'dromaeojs-e10s', 05:05:43 INFO - 'system_bits': '32', 05:05:43 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:05:43 INFO - 'title': 'talos-linux64-ix-002', 05:05:43 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:05:43 INFO - 'use_talos_json': True, 05:05:43 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:05:43 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:05:43 INFO - 'work_dir': 'build'} 05:05:43 INFO - ##### 05:05:43 INFO - ##### Running clobber step. 05:05:43 INFO - ##### 05:05:43 INFO - Running pre-action listener: _resource_record_pre_action 05:05:43 INFO - Running main action method: clobber 05:05:43 INFO - rmtree: /builds/slave/test/build 05:05:43 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:05:43 INFO - Running post-action listener: _resource_record_post_action 05:05:43 INFO - ##### 05:05:43 INFO - ##### Running read-buildbot-config step. 05:05:43 INFO - ##### 05:05:43 INFO - Running pre-action listener: _resource_record_pre_action 05:05:43 INFO - Running main action method: read_buildbot_config 05:05:43 INFO - Using buildbot properties: 05:05:43 INFO - { 05:05:43 INFO - "project": "", 05:05:43 INFO - "product": "firefox", 05:05:43 INFO - "script_repo_revision": "production", 05:05:43 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 05:05:43 INFO - "repository": "", 05:05:43 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 05:05:43 INFO - "buildid": "20160502023014", 05:05:43 INFO - "pgo_build": "True", 05:05:43 INFO - "basedir": "/builds/slave/test", 05:05:43 INFO - "buildnumber": 429, 05:05:43 INFO - "slavename": "talos-linux64-ix-002", 05:05:43 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:05:43 INFO - "platform": "ubuntu64_hw", 05:05:43 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 05:05:43 INFO - "branch": "fx-team", 05:05:43 INFO - "repo_path": "integration/fx-team", 05:05:43 INFO - "revision": "33b4d01f08e4b89e172be41517a65586b4e59699", 05:05:43 INFO - "stage_platform": "linux64-pgo", 05:05:43 INFO - "builduid": "5f38379620f34e8f91e075b0e0fb2a27", 05:05:43 INFO - "slavebuilddir": "test" 05:05:43 INFO - } 05:05:43 INFO - Found installer url https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 05:05:43 INFO - Running post-action listener: _resource_record_post_action 05:05:43 INFO - ##### 05:05:43 INFO - ##### Running download-and-extract step. 05:05:43 INFO - ##### 05:05:43 INFO - Running pre-action listener: _resource_record_pre_action 05:05:43 INFO - Running main action method: download_and_extract 05:05:43 INFO - mkdir: /builds/slave/test/build/tests 05:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:05:43 INFO - https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 05:05:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 05:05:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 05:05:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 05:05:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 05:06:13 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json: timed out 05:06:13 INFO - retry: attempt #1 caught exception: timed out 05:06:13 INFO - retry: Failed, sleeping 30 seconds before retrying 05:06:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #2 05:07:13 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json: timed out 05:07:13 INFO - retry: attempt #2 caught exception: timed out 05:07:13 INFO - retry: Failed, sleeping 60 seconds before retrying 05:08:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #3 05:08:44 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json: timed out 05:08:44 INFO - retry: attempt #3 caught exception: timed out 05:08:44 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json! 05:08:44 INFO - Caught exception: timed out 05:08:44 INFO - Caught exception: timed out 05:08:44 INFO - Caught exception: timed out 05:08:44 INFO - trying https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 05:08:44 INFO - Downloading https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 05:08:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 05:08:45 INFO - Downloaded 1361 bytes. 05:08:45 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 05:08:45 INFO - Using the following test package requirements: 05:08:45 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 05:08:45 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 05:08:45 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:08:45 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 05:08:45 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:08:45 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 05:08:45 INFO - u'jsshell-linux-x86_64.zip'], 05:08:45 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 05:08:45 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:08:45 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 05:08:45 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 05:08:45 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:08:45 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 05:08:45 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:08:45 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 05:08:45 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:08:45 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 05:08:45 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:08:45 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:08: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:08:45 INFO - https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:08:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:08:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:08:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:08:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:09:15 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 05:09:15 INFO - retry: attempt #1 caught exception: timed out 05:09:15 INFO - retry: Failed, sleeping 30 seconds before retrying 05:09:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #2 05:10:15 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 05:10:15 INFO - retry: attempt #2 caught exception: timed out 05:10:15 INFO - retry: Failed, sleeping 60 seconds before retrying 05:11:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #3 05:11:45 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 05:11:45 INFO - retry: attempt #3 caught exception: timed out 05:11:45 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip! 05:11:45 INFO - Caught exception: timed out 05:11:45 INFO - Caught exception: timed out 05:11:45 INFO - Caught exception: timed out 05:11:45 INFO - trying https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:11:45 INFO - Downloading https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:11:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:11:46 INFO - Downloaded 23878571 bytes. 05:11:46 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:11:46 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 05:11:47 INFO - Return code: 0 05:11:47 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:11:47 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:11:47 INFO - https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:11:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:11:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:11:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:11:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:12:17 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 05:12:17 INFO - retry: attempt #1 caught exception: timed out 05:12:17 INFO - retry: Failed, sleeping 30 seconds before retrying 05:12:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #2 05:13:17 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 05:13:17 INFO - retry: attempt #2 caught exception: timed out 05:13:17 INFO - retry: Failed, sleeping 60 seconds before retrying 05:14:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #3 05:14:38 WARNING - Server returned status 502 HTTP Error 502: Bad Gateway for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:14:38 INFO - retry: attempt #3 caught exception: HTTP Error 502: Bad Gateway 05:14:38 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip! 05:14:38 INFO - Caught exception: timed out 05:14:38 INFO - Caught exception: timed out 05:14:38 INFO - Caught exception: HTTP Error 502: Bad Gateway 05:14:38 INFO - trying https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:14:38 INFO - Downloading https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 05:14:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:14:40 INFO - Downloaded 23878571 bytes. 05:14:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:14:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 05:14:42 INFO - Return code: 0 05:14: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:14:42 INFO - https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:14:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 05:14:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 05:14:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 05:14:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:15:12 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip: timed out 05:15:12 INFO - retry: attempt #1 caught exception: timed out 05:15:12 INFO - retry: Failed, sleeping 30 seconds before retrying 05:15:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #2 05:16:12 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip: timed out 05:16:12 INFO - retry: attempt #2 caught exception: timed out 05:16:12 INFO - retry: Failed, sleeping 60 seconds before retrying 05:17:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #3 05:17:42 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip: timed out 05:17:42 INFO - retry: attempt #3 caught exception: timed out 05:17:42 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip! 05:17:42 INFO - Caught exception: timed out 05:17:42 INFO - Caught exception: timed out 05:17:42 INFO - Caught exception: timed out 05:17:42 INFO - trying https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 05:17:42 INFO - Downloading https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 05:17:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:17:44 INFO - Downloaded 10840152 bytes. 05:17:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:17:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 05:17:44 INFO - Return code: 0 05:17:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:17:44 INFO - https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:17:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 05:17:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 05:17:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 05:17:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:18:14 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2: timed out 05:18:14 INFO - retry: attempt #1 caught exception: timed out 05:18:14 INFO - retry: Failed, sleeping 30 seconds before retrying 05:18:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #2 05:19:14 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2: timed out 05:19:14 INFO - retry: attempt #2 caught exception: timed out 05:19:14 INFO - retry: Failed, sleeping 60 seconds before retrying 05:20:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #3 05:20:44 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2: timed out 05:20:44 INFO - retry: attempt #3 caught exception: timed out 05:20:44 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2! 05:20:44 INFO - Caught exception: timed out 05:20:44 INFO - Caught exception: timed out 05:20:44 INFO - Caught exception: timed out 05:20:44 INFO - trying https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 05:20:44 INFO - Downloading https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 05:20:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:20:46 INFO - Downloaded 58596267 bytes. 05:20:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 05:20:46 INFO - mkdir: /builds/slave/test/properties 05:20:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:20:46 INFO - Writing to file /builds/slave/test/properties/build_url 05:20:46 INFO - Contents: 05:20:46 INFO - build_url:https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 05:20:46 INFO - Running post-action listener: _resource_record_post_action 05:20:46 INFO - Running post-action listener: set_extra_try_arguments 05:20:46 INFO - ##### 05:20:46 INFO - ##### Running populate-webroot step. 05:20:46 INFO - ##### 05:20:46 INFO - Running pre-action listener: _resource_record_pre_action 05:20:46 INFO - Running main action method: populate_webroot 05:20:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:20:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:20:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:20:46 INFO - '--tppagecycles', 05:20:46 INFO - '7'], 05:20:46 INFO - 'tests': ['tsvgm']}}, 05:20:46 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:20:46 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:20:46 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:20:46 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:20:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:20:46 INFO - 'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:20:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:20:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:20:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:20:46 INFO - 'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['damp', 'tps']}, 05:20:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:20:46 INFO - 'tests': ['damp', 'tps']}, 05:20:46 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['dromaeo_dom']}, 05:20:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:20:46 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['a11yr', 05:20:46 INFO - 'ts_paint', 05:20:46 INFO - 'tpaint', 05:20:46 INFO - 'sessionrestore', 05:20:46 INFO - 'sessionrestore_no_auto_restore', 05:20:46 INFO - 'tabpaint']}, 05:20:46 INFO - 'other-e10s': {'tests': ['a11yr', 05:20:46 INFO - 'ts_paint', 05:20:46 INFO - 'tpaint', 05:20:46 INFO - 'sessionrestore', 05:20:46 INFO - 'sessionrestore_no_auto_restore', 05:20:46 INFO - 'tabpaint']}, 05:20:46 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:20:46 INFO - 'ts_paint', 05:20:46 INFO - 'tpaint', 05:20:46 INFO - 'sessionrestore', 05:20:46 INFO - 'sessionrestore_no_auto_restore', 05:20:46 INFO - 'tabpaint']}, 05:20:46 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:20:46 INFO - 'ts_paint', 05:20:46 INFO - 'tpaint', 05:20:46 INFO - 'sessionrestore', 05:20:46 INFO - 'sessionrestore_no_auto_restore', 05:20:46 INFO - 'tabpaint']}, 05:20:46 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['a11yr', 05:20:46 INFO - 'ts_paint', 05:20:46 INFO - 'tpaint', 05:20:46 INFO - 'sessionrestore', 05:20:46 INFO - 'sessionrestore_no_auto_restore', 05:20:46 INFO - 'tabpaint']}, 05:20:46 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['a11yr', 05:20:46 INFO - 'ts_paint', 05:20:46 INFO - 'tpaint', 05:20:46 INFO - 'sessionrestore', 05:20:46 INFO - 'sessionrestore_no_auto_restore', 05:20:46 INFO - 'tabpaint']}, 05:20:46 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['tsvgx', 05:20:46 INFO - 'tsvgr_opacity', 05:20:46 INFO - 'tart', 05:20:46 INFO - 'tscrollx', 05:20:46 INFO - 'cart']}, 05:20:46 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:20:46 INFO - 'tsvgr_opacity', 05:20:46 INFO - 'tart', 05:20:46 INFO - 'tscrollx', 05:20:46 INFO - 'cart']}, 05:20:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:20:46 INFO - 'talos_options': ['--disable-e10s'], 05:20:46 INFO - 'tests': ['tp5o']}, 05:20:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:20:46 INFO - 'tests': ['tp5o']}, 05:20:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:20:46 INFO - 'talos_options': ['--disable-e10s', 05:20:46 INFO - '--xperf_path', 05:20:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:20:46 INFO - 'tests': ['tp5n']}, 05:20:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:20:46 INFO - 'talos_options': ['--xperf_path', 05:20:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:20:46 INFO - 'tests': ['tp5n']}}, 05:20:46 INFO - 'talos.zip': {'path': '', 05:20:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:20:46 INFO - Running post-action listener: _resource_record_post_action 05:20:46 INFO - ##### 05:20:46 INFO - ##### Running create-virtualenv step. 05:20:46 INFO - ##### 05:20:46 INFO - Running pre-action listener: _resource_record_pre_action 05:20:46 INFO - Running main action method: create_virtualenv 05:20:46 INFO - Creating virtualenv /builds/slave/test/build/venv 05:20:46 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:20:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:20:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:20:46 INFO - Using real prefix '/usr' 05:20:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:20:47 INFO - Installing distribute.............................................................................................................................................................................................done. 05:20:49 INFO - Installing pip.................done. 05:20:49 INFO - Return code: 0 05:20:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:20:49 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:20:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:20:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:49 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:20:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:20:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:49 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 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:20:49 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:20:49 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:20:49 INFO - Using env: {'DISPLAY': ':0', 05:20:49 INFO - 'HOME': '/home/cltbld', 05:20:49 INFO - 'LANG': 'en_US.UTF-8', 05:20:49 INFO - 'LANGUAGE': 'en_US:en', 05:20:49 INFO - 'LOGNAME': 'cltbld', 05:20:49 INFO - 'MAIL': '/var/mail/cltbld', 05:20:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:20:49 INFO - 'MOZ_NO_REMOTE': '1', 05:20:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:20:49 INFO - 'NO_EM_RESTART': '1', 05:20:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:20:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:20:49 INFO - 'PWD': '/builds/slave/test', 05:20:49 INFO - 'SHELL': '/bin/bash', 05:20:49 INFO - 'SHLVL': '1', 05:20:49 INFO - 'TERM': 'linux', 05:20:49 INFO - 'TMOUT': '86400', 05:20:49 INFO - 'USER': 'cltbld', 05:20:49 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:20:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:20:49 INFO - '_': '/tools/buildbot/bin/python'} 05:20:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:20:49 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:20:49 INFO - Cleaning up... 05:20:49 INFO - Return code: 0 05:20:49 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:20:49 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:20:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:20:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:49 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:20:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:20:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:49 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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:20:49 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>=0.7.1'] in /builds/slave/test/build 05:20:49 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>=0.7.1 05:20:49 INFO - Using env: {'DISPLAY': ':0', 05:20:49 INFO - 'HOME': '/home/cltbld', 05:20:49 INFO - 'LANG': 'en_US.UTF-8', 05:20:49 INFO - 'LANGUAGE': 'en_US:en', 05:20:49 INFO - 'LOGNAME': 'cltbld', 05:20:49 INFO - 'MAIL': '/var/mail/cltbld', 05:20:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:20:49 INFO - 'MOZ_NO_REMOTE': '1', 05:20:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:20:49 INFO - 'NO_EM_RESTART': '1', 05:20:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:20:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:20:49 INFO - 'PWD': '/builds/slave/test', 05:20:49 INFO - 'SHELL': '/bin/bash', 05:20:49 INFO - 'SHLVL': '1', 05:20:49 INFO - 'TERM': 'linux', 05:20:49 INFO - 'TMOUT': '86400', 05:20:49 INFO - 'USER': 'cltbld', 05:20:49 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:20:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:20:49 INFO - '_': '/tools/buildbot/bin/python'} 05:20:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:20:49 INFO - Downloading/unpacking psutil>=0.7.1 05:20:49 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:20:49 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:20:49 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:20:49 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:20:49 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:20:49 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:20:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:20:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:20:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:20:51 INFO - Installing collected packages: psutil 05:20:51 INFO - Running setup.py install for psutil 05:20:51 INFO - building 'psutil._psutil_linux' extension 05:20:51 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:20:51 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:20:52 INFO - building 'psutil._psutil_posix' extension 05:20:52 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:20:52 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:20:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:20:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:20:52 INFO - Successfully installed psutil 05:20:52 INFO - Cleaning up... 05:20:52 INFO - Return code: 0 05:20:52 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:20: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:20:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:20:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20: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:20:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:20:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:52 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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:20:52 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.0.0'] in /builds/slave/test/build 05:20:52 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.0.0 05:20:52 INFO - Using env: {'DISPLAY': ':0', 05:20:52 INFO - 'HOME': '/home/cltbld', 05:20:52 INFO - 'LANG': 'en_US.UTF-8', 05:20:52 INFO - 'LANGUAGE': 'en_US:en', 05:20:52 INFO - 'LOGNAME': 'cltbld', 05:20:52 INFO - 'MAIL': '/var/mail/cltbld', 05:20:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:20:52 INFO - 'MOZ_NO_REMOTE': '1', 05:20:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:20:52 INFO - 'NO_EM_RESTART': '1', 05:20:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:20:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:20:52 INFO - 'PWD': '/builds/slave/test', 05:20:52 INFO - 'SHELL': '/bin/bash', 05:20:52 INFO - 'SHLVL': '1', 05:20:52 INFO - 'TERM': 'linux', 05:20:52 INFO - 'TMOUT': '86400', 05:20:52 INFO - 'USER': 'cltbld', 05:20:52 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:20:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:20:52 INFO - '_': '/tools/buildbot/bin/python'} 05:20:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:20:52 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:20:52 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:20:52 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:20:52 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:20:52 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:20:52 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:20:52 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:20:54 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:20:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:20:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:20:54 INFO - Installing collected packages: mozsystemmonitor 05:20:54 INFO - Running setup.py install for mozsystemmonitor 05:20:54 INFO - Successfully installed mozsystemmonitor 05:20:54 INFO - Cleaning up... 05:20:54 INFO - Return code: 0 05:20:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:20:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:20:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:20:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:20:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:20:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:54 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 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:20:54 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:20:54 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:20:54 INFO - Using env: {'DISPLAY': ':0', 05:20:54 INFO - 'HOME': '/home/cltbld', 05:20:54 INFO - 'LANG': 'en_US.UTF-8', 05:20:54 INFO - 'LANGUAGE': 'en_US:en', 05:20:54 INFO - 'LOGNAME': 'cltbld', 05:20:54 INFO - 'MAIL': '/var/mail/cltbld', 05:20:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:20:54 INFO - 'MOZ_NO_REMOTE': '1', 05:20:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:20:54 INFO - 'NO_EM_RESTART': '1', 05:20:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:20:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:20:54 INFO - 'PWD': '/builds/slave/test', 05:20:54 INFO - 'SHELL': '/bin/bash', 05:20:54 INFO - 'SHLVL': '1', 05:20:54 INFO - 'TERM': 'linux', 05:20:54 INFO - 'TMOUT': '86400', 05:20:54 INFO - 'USER': 'cltbld', 05:20:54 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:20:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:20:54 INFO - '_': '/tools/buildbot/bin/python'} 05:20:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:20:54 INFO - Downloading/unpacking blobuploader==1.2.4 05:20:54 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:20:54 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:20:54 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:20:54 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:20:54 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:20:54 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:20:56 INFO - Downloading blobuploader-1.2.4.tar.gz 05:20:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:20:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:20:56 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:20:56 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:20:56 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:20:56 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:20:56 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:20:56 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:20:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:20:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:20:57 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:20:57 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:20:57 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:20:57 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:20:57 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:20:57 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:20:57 INFO - Downloading docopt-0.6.1.tar.gz 05:20:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:20:57 INFO - Installing collected packages: blobuploader, requests, docopt 05:20:57 INFO - Running setup.py install for blobuploader 05:20:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:20:57 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:20:57 INFO - Running setup.py install for requests 05:20:57 INFO - Running setup.py install for docopt 05:20:57 INFO - Successfully installed blobuploader requests docopt 05:20:57 INFO - Cleaning up... 05:20:58 INFO - Return code: 0 05:20:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:20:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:20:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:20:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:20:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:20:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:20:58 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 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:20:58 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:20:58 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:20:58 INFO - Using env: {'DISPLAY': ':0', 05:20:58 INFO - 'HOME': '/home/cltbld', 05:20:58 INFO - 'LANG': 'en_US.UTF-8', 05:20:58 INFO - 'LANGUAGE': 'en_US:en', 05:20:58 INFO - 'LOGNAME': 'cltbld', 05:20:58 INFO - 'MAIL': '/var/mail/cltbld', 05:20:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:20:58 INFO - 'MOZ_NO_REMOTE': '1', 05:20:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:20:58 INFO - 'NO_EM_RESTART': '1', 05:20:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:20:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:20:58 INFO - 'PWD': '/builds/slave/test', 05:20:58 INFO - 'SHELL': '/bin/bash', 05:20:58 INFO - 'SHLVL': '1', 05:20:58 INFO - 'TERM': 'linux', 05:20:58 INFO - 'TMOUT': '86400', 05:20:58 INFO - 'USER': 'cltbld', 05:20:58 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:20:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:20:58 INFO - '_': '/tools/buildbot/bin/python'} 05:20:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:20:58 INFO - Running setup.py (path:/tmp/pip-KE0K0J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:20:58 INFO - Running setup.py (path:/tmp/pip-KihRhR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:20:58 INFO - Running setup.py (path:/tmp/pip-EUMAsH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:20:58 INFO - Running setup.py (path:/tmp/pip-cR6CRK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:20:58 INFO - Running setup.py (path:/tmp/pip-hbXz4e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:20:58 INFO - Running setup.py (path:/tmp/pip-76xF1T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:20:58 INFO - Running setup.py (path:/tmp/pip-EhmAXj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:20:58 INFO - Running setup.py (path:/tmp/pip-HlS17k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:20:58 INFO - Running setup.py (path:/tmp/pip-Ee_yrl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:20:58 INFO - Running setup.py (path:/tmp/pip-4xRTiZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:20:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:20:58 INFO - Running setup.py (path:/tmp/pip-jd7Cm7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:20:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:20:59 INFO - Running setup.py (path:/tmp/pip-1lHa0j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:20:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:20:59 INFO - Running setup.py (path:/tmp/pip-EtVhWU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:20:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:20:59 INFO - Running setup.py (path:/tmp/pip-drYQaj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:20:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:20:59 INFO - Running setup.py (path:/tmp/pip-uQ4KuO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:20:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:20:59 INFO - Running setup.py (path:/tmp/pip-64hVNX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:20:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:20:59 INFO - Running setup.py (path:/tmp/pip-SVpNRm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:20:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:20:59 INFO - Running setup.py install for manifestparser 05:20:59 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:20:59 INFO - Running setup.py install for mozcrash 05:20:59 INFO - Running setup.py install for mozdebug 05:20:59 INFO - Running setup.py install for mozdevice 05:20:59 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:20:59 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:20:59 INFO - Running setup.py install for mozfile 05:20:59 INFO - Running setup.py install for mozhttpd 05:21:00 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Running setup.py install for mozinfo 05:21:00 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Running setup.py install for mozInstall 05:21:00 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Running setup.py install for mozleak 05:21:00 INFO - Running setup.py install for mozlog 05:21:00 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Running setup.py install for moznetwork 05:21:00 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Running setup.py install for mozprocess 05:21:00 INFO - Running setup.py install for mozprofile 05:21:00 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Running setup.py install for mozrunner 05:21:00 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:21:00 INFO - Running setup.py install for mozscreenshot 05:21:01 INFO - Running setup.py install for moztest 05:21:01 INFO - Running setup.py install for mozversion 05:21:01 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:21:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:21:01 INFO - Cleaning up... 05:21:01 INFO - Return code: 0 05:21:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:21:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:21:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:21:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:21:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:21:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:21:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:21:01 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 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:21:01 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:21:01 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:21:01 INFO - Using env: {'DISPLAY': ':0', 05:21:01 INFO - 'HOME': '/home/cltbld', 05:21:01 INFO - 'LANG': 'en_US.UTF-8', 05:21:01 INFO - 'LANGUAGE': 'en_US:en', 05:21:01 INFO - 'LOGNAME': 'cltbld', 05:21:01 INFO - 'MAIL': '/var/mail/cltbld', 05:21:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:21:01 INFO - 'MOZ_NO_REMOTE': '1', 05:21:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:21:01 INFO - 'NO_EM_RESTART': '1', 05:21:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:21:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:21:01 INFO - 'PWD': '/builds/slave/test', 05:21:01 INFO - 'SHELL': '/bin/bash', 05:21:01 INFO - 'SHLVL': '1', 05:21:01 INFO - 'TERM': 'linux', 05:21:01 INFO - 'TMOUT': '86400', 05:21:01 INFO - 'USER': 'cltbld', 05:21:01 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:21:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:21:01 INFO - '_': '/tools/buildbot/bin/python'} 05:21:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:21:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:21:01 INFO - Running setup.py (path:/tmp/pip-7cLxMX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:21:01 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:21:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:21:01 INFO - Running setup.py (path:/tmp/pip-a6jz1C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:21:01 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:21:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:21:01 INFO - Running setup.py (path:/tmp/pip-JNFTh5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:21:01 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:21:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:21:01 INFO - Running setup.py (path:/tmp/pip-4LiFU0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:21:01 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:21:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:21:01 INFO - Running setup.py (path:/tmp/pip-_WkeKj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:21:01 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:21:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:21:01 INFO - Running setup.py (path:/tmp/pip-qgFq1r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:21:01 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:21:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:21:01 INFO - Running setup.py (path:/tmp/pip-OVU7rq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:21:01 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:21:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:21:01 INFO - Running setup.py (path:/tmp/pip-nBivFD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:21:02 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:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:21:02 INFO - Running setup.py (path:/tmp/pip-SMfYoD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:21:02 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:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:21:02 INFO - Running setup.py (path:/tmp/pip-rj1y8X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:21:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:21:02 INFO - Running setup.py (path:/tmp/pip-gBUCel-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:21:02 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:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:21:02 INFO - Running setup.py (path:/tmp/pip-1D_t2E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:21:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 05:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:21:02 INFO - Running setup.py (path:/tmp/pip-EnGM7Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:21:02 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:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:21:02 INFO - Running setup.py (path:/tmp/pip-9vZNOG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:21:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 05:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:21:02 INFO - Running setup.py (path:/tmp/pip-ZyXG2L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:21:02 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:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:21:02 INFO - Running setup.py (path:/tmp/pip-MgpPP7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:21:02 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:21:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:21:02 INFO - Running setup.py (path:/tmp/pip-snZcXJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:21:02 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:21:02 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:21:02 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:21:02 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:21:02 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:21:02 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:21:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:21:02 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:21:02 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:21:02 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:21:02 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:21:02 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:21:02 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:21:04 INFO - Downloading blessings-1.6.tar.gz 05:21:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:21:04 INFO - Installing collected packages: blessings 05:21:04 INFO - Running setup.py install for blessings 05:21:04 INFO - Successfully installed blessings 05:21:04 INFO - Cleaning up... 05:21:04 INFO - Return code: 0 05:21:04 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:21:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:21:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:21:04 INFO - Reading from file tmpfile_stdout 05:21:04 INFO - Current package versions: 05:21:04 INFO - argparse == 1.2.1 05:21:04 INFO - blessings == 1.6 05:21:04 INFO - blobuploader == 1.2.4 05:21:04 INFO - docopt == 0.6.1 05:21:04 INFO - manifestparser == 1.1 05:21:04 INFO - mozInstall == 1.12 05:21:04 INFO - mozcrash == 0.17 05:21:04 INFO - mozdebug == 0.1 05:21:04 INFO - mozdevice == 0.48 05:21:04 INFO - mozfile == 1.2 05:21:04 INFO - mozhttpd == 0.7 05:21:04 INFO - mozinfo == 0.9 05:21:04 INFO - mozleak == 0.1 05:21:04 INFO - mozlog == 3.1 05:21:04 INFO - moznetwork == 0.27 05:21:04 INFO - mozprocess == 0.22 05:21:04 INFO - mozprofile == 0.28 05:21:04 INFO - mozrunner == 6.11 05:21:04 INFO - mozscreenshot == 0.1 05:21:04 INFO - mozsystemmonitor == 0.0 05:21:04 INFO - moztest == 0.7 05:21:04 INFO - mozversion == 1.4 05:21:04 INFO - psutil == 3.1.1 05:21:04 INFO - requests == 1.2.3 05:21:04 INFO - wsgiref == 0.1.2 05:21:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:21:04 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:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:21:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:21:05 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:21:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:21:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:21:05 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 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:21:05 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:21:05 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:21:05 INFO - Using env: {'DISPLAY': ':0', 05:21:05 INFO - 'HOME': '/home/cltbld', 05:21:05 INFO - 'LANG': 'en_US.UTF-8', 05:21:05 INFO - 'LANGUAGE': 'en_US:en', 05:21:05 INFO - 'LOGNAME': 'cltbld', 05:21:05 INFO - 'MAIL': '/var/mail/cltbld', 05:21:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:21:05 INFO - 'MOZ_NO_REMOTE': '1', 05:21:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:21:05 INFO - 'NO_EM_RESTART': '1', 05:21:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:21:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:21:05 INFO - 'PWD': '/builds/slave/test', 05:21:05 INFO - 'SHELL': '/bin/bash', 05:21:05 INFO - 'SHLVL': '1', 05:21:05 INFO - 'TERM': 'linux', 05:21:05 INFO - 'TMOUT': '86400', 05:21:05 INFO - 'USER': 'cltbld', 05:21:05 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:21:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:21:05 INFO - '_': '/tools/buildbot/bin/python'} 05:21:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:21:05 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:21:05 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:21:05 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:21:05 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:21:05 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:21:05 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:21:05 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:21:05 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:21:05 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:21:05 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:21:05 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:21:05 INFO - Cleaning up... 05:21:05 INFO - Return code: 0 05:21:05 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:21:05 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:21:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:21:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:21:05 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:21:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:21:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:21:05 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 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:21:05 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:21:05 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:21:05 INFO - Using env: {'DISPLAY': ':0', 05:21:05 INFO - 'HOME': '/home/cltbld', 05:21:05 INFO - 'LANG': 'en_US.UTF-8', 05:21:05 INFO - 'LANGUAGE': 'en_US:en', 05:21:05 INFO - 'LOGNAME': 'cltbld', 05:21:05 INFO - 'MAIL': '/var/mail/cltbld', 05:21:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:21:05 INFO - 'MOZ_NO_REMOTE': '1', 05:21:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:21:05 INFO - 'NO_EM_RESTART': '1', 05:21:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:21:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:21:05 INFO - 'PWD': '/builds/slave/test', 05:21:05 INFO - 'SHELL': '/bin/bash', 05:21:05 INFO - 'SHLVL': '1', 05:21:05 INFO - 'TERM': 'linux', 05:21:05 INFO - 'TMOUT': '86400', 05:21:05 INFO - 'USER': 'cltbld', 05:21:05 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:21:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:21:05 INFO - '_': '/tools/buildbot/bin/python'} 05:21:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:21:05 INFO - Downloading/unpacking jsonschema 05:21:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:21:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:21:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:21:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:21:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:21:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:21:07 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:21:07 INFO - Downloading/unpacking functools32 (from jsonschema) 05:21:07 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:21:07 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:21:07 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:21:07 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:21:07 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:21:07 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:21:07 INFO - Downloading functools32-3.2.3-2.tar.gz 05:21:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:21:07 INFO - warning: no files found matching '*.txt' 05:21:07 INFO - no previously-included directories found matching 'build' 05:21:07 INFO - no previously-included directories found matching 'dist' 05:21:07 INFO - no previously-included directories found matching '.git*' 05:21:07 INFO - Installing collected packages: jsonschema, functools32 05:21:07 INFO - Running setup.py install for functools32 05:21:07 INFO - warning: no files found matching '*.txt' 05:21:07 INFO - no previously-included directories found matching 'build' 05:21:07 INFO - no previously-included directories found matching 'dist' 05:21:07 INFO - no previously-included directories found matching '.git*' 05:21:07 INFO - Successfully installed jsonschema functools32 05:21:07 INFO - Cleaning up... 05:21:07 INFO - Return code: 0 05:21:07 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 05:21:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:21:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:21:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:21:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:21:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:21:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:21:07 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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc64d984f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13e88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14b35a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', '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:21:07 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', 'flake8'] in /builds/slave/test/build 05:21:07 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 flake8 05:21:07 INFO - Using env: {'DISPLAY': ':0', 05:21:07 INFO - 'HOME': '/home/cltbld', 05:21:07 INFO - 'LANG': 'en_US.UTF-8', 05:21:07 INFO - 'LANGUAGE': 'en_US:en', 05:21:07 INFO - 'LOGNAME': 'cltbld', 05:21:07 INFO - 'MAIL': '/var/mail/cltbld', 05:21:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:21:07 INFO - 'MOZ_NO_REMOTE': '1', 05:21:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:21:07 INFO - 'NO_EM_RESTART': '1', 05:21:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:21:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:21:07 INFO - 'PWD': '/builds/slave/test', 05:21:07 INFO - 'SHELL': '/bin/bash', 05:21:07 INFO - 'SHLVL': '1', 05:21:07 INFO - 'TERM': 'linux', 05:21:07 INFO - 'TMOUT': '86400', 05:21:07 INFO - 'USER': 'cltbld', 05:21:07 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:21:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:21:07 INFO - '_': '/tools/buildbot/bin/python'} 05:21:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:21:07 INFO - Downloading/unpacking flake8 05:21:07 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:21:07 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:21:07 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:21:07 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:21:07 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:21:07 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:21:09 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:21:09 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:21:09 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:21:09 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:21:09 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:21:09 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:21:09 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:21:09 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:21:10 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:21:10 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:21:10 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:21:10 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:21:10 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:21:10 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:21:10 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:21:10 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:21:10 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:21:10 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:21:10 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:21:10 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:21:10 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:21:10 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:21:10 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:21:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 05:21:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:21:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:21:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:21:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:21:10 INFO - no previously-included directories found matching 'docs/_build' 05:21:10 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:21:10 INFO - Running setup.py install for pep8 05:21:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:21:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:21:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:21:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:21:10 INFO - no previously-included directories found matching 'docs/_build' 05:21:10 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 05:21:10 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:21:10 INFO - Cleaning up... 05:21:10 INFO - Return code: 0 05:21:10 INFO - Running post-action listener: _resource_record_post_action 05:21:10 INFO - Running post-action listener: _start_resource_monitoring 05:21:10 INFO - Starting resource monitoring. 05:21:10 INFO - ##### 05:21:10 INFO - ##### Running install step. 05:21:10 INFO - ##### 05:21:10 INFO - Running pre-action listener: _resource_record_pre_action 05:21:10 INFO - Running main action method: install 05:21:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:21:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:21:11 INFO - Reading from file tmpfile_stdout 05:21:11 INFO - Detecting whether we're running mozinstall >=1.0... 05:21:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:21:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:21:11 INFO - Reading from file tmpfile_stdout 05:21:11 INFO - Output received: 05:21:11 INFO - Usage: mozinstall [options] installer 05:21:11 INFO - Options: 05:21:11 INFO - -h, --help show this help message and exit 05:21:11 INFO - -d DEST, --destination=DEST 05:21:11 INFO - Directory to install application into. [default: 05:21:11 INFO - "/builds/slave/test"] 05:21:11 INFO - --app=APP Application being installed. [default: firefox] 05:21:11 INFO - mkdir: /builds/slave/test/build/application 05:21:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:21:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 05:21:27 INFO - Reading from file tmpfile_stdout 05:21:27 INFO - Output received: 05:21:27 INFO - /builds/slave/test/build/application/firefox/firefox 05:21:27 INFO - Running post-action listener: _resource_record_post_action 05:21:27 INFO - ##### 05:21:27 INFO - ##### Running run-tests step. 05:21:27 INFO - ##### 05:21:27 INFO - Running pre-action listener: _resource_record_pre_action 05:21:27 INFO - Running main action method: run_tests 05:21:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:21:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:21:27 INFO - Python 2.7.3 05:21:27 INFO - Return code: 0 05:21:27 INFO - grabbing minidump binary from tooltool 05:21: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:21:27 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1542410>, '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 0x1543310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15437a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:21:27 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:21:27 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:21:27 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:21:27 INFO - Return code: 0 05:21:27 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:21:27 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:21:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:21:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:21:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:21:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 05:21:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 05:21:28 INFO - Return code: 0 05:21:28 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/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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:21:28 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/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-002 --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:21:28 INFO - Using env: {'DISPLAY': ':0', 05:21:28 INFO - 'HOME': '/home/cltbld', 05:21:28 INFO - 'LANG': 'en_US.UTF-8', 05:21:28 INFO - 'LANGUAGE': 'en_US:en', 05:21:28 INFO - 'LOGNAME': 'cltbld', 05:21:28 INFO - 'MAIL': '/var/mail/cltbld', 05:21:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:21:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:21:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:21:28 INFO - 'MOZ_NO_REMOTE': '1', 05:21:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:21:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:21:28 INFO - 'NO_EM_RESTART': '1', 05:21:28 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:21:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:21:28 INFO - 'PWD': '/builds/slave/test', 05:21:28 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:21:28 INFO - 'SHELL': '/bin/bash', 05:21:28 INFO - 'SHLVL': '1', 05:21:28 INFO - 'TERM': 'linux', 05:21:28 INFO - 'TMOUT': '86400', 05:21:28 INFO - 'USER': 'cltbld', 05:21:28 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700', 05:21:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:21:28 INFO - '_': '/tools/buildbot/bin/python'} 05:21:28 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/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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:21:28 INFO - mozversion application_buildid: 20160502023014 05:21:28 INFO - mozversion application_changeset: 33b4d01f08e4b89e172be41517a65586b4e59699 05:21:28 INFO - mozversion application_display_name: Nightly 05:21:28 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:21:28 INFO - mozversion application_name: Firefox 05:21:28 INFO - mozversion application_remotingname: firefox 05:21:28 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 05:21:28 INFO - mozversion application_vendor: Mozilla 05:21:28 INFO - mozversion application_version: 49.0a1 05:21:28 INFO - mozversion platform_buildid: 20160502023014 05:21:28 INFO - mozversion platform_changeset: 33b4d01f08e4b89e172be41517a65586b4e59699 05:21:28 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 05:21:28 INFO - mozversion platform_version: 49.0a1 05:21:28 INFO - using testdate: 1462191688 05:21:28 INFO - actual date: 1462191688 05:21:28 INFO - starting webserver on 'localhost:56036' 05:21:28 INFO - SUITE-START | Running 2 tests 05:21:28 INFO - TEST-START | dromaeo_css 05:21:28 INFO - operating with platform_type : linux_ 05:21:28 INFO - Initialising browser for dromaeo_css test... 05:21:28 INFO - TEST-INFO | started process 18475 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdFq14v/profile http://localhost:56036/getInfo.html) 05:21:33 INFO - PROCESS | 18475 | 05:21:33 INFO - PROCESS | 18475 | (process:18548): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:21:33 INFO - PROCESS | 18475 | __metrics Screen width/height:1600/1200 05:21:33 INFO - PROCESS | 18475 | colorDepth:24 05:21:33 INFO - PROCESS | 18475 | Browser inner width/height: 1024/697 05:21:33 INFO - PROCESS | 18475 | __metrics 05:21:34 ERROR - PROCESS | 18475 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 05:21:35 INFO - TEST-INFO | 18475: exit 0 05:21:35 INFO - Browser initialized. 05:21:35 INFO - Running cycle 1/1 for dromaeo_css test... 05:21:35 INFO - TEST-INFO | started process 18599 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdFq14v/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:21:37 INFO - PROCESS | 18599 | 05:21:37 INFO - PROCESS | 18599 | (process:18660): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:21:47 INFO - PROCESS | 18599 | RSS: Main: 165228544 05:21:47 INFO - PROCESS | 18599 | 05:22:36 INFO - PROCESS | 18599 | 1462191756978 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:24:44 INFO - PROCESS | 18599 | Cycle 1(1): loaded http://localhost:56036/tests/dromaeo/cssquery-dojo.html (next: http://localhost:56036/tests/dromaeo/cssquery-ext.html) 05:24:45 INFO - PROCESS | 18599 | RSS: Main: 168468480 05:24:45 INFO - PROCESS | 18599 | 05:27:47 INFO - PROCESS | 18599 | Cycle 1(1): loaded http://localhost:56036/tests/dromaeo/cssquery-ext.html (next: http://localhost:56036/tests/dromaeo/cssquery-jquery.html) 05:27:48 INFO - PROCESS | 18599 | RSS: Main: 166604800 05:27:48 INFO - PROCESS | 18599 | 05:30:49 INFO - PROCESS | 18599 | Cycle 1(1): loaded http://localhost:56036/tests/dromaeo/cssquery-jquery.html (next: http://localhost:56036/tests/dromaeo/cssquery-mootools.html) 05:30:50 INFO - PROCESS | 18599 | RSS: Main: 167960576 05:30:50 INFO - PROCESS | 18599 | 05:33:52 INFO - PROCESS | 18599 | Cycle 1(1): loaded http://localhost:56036/tests/dromaeo/cssquery-mootools.html (next: http://localhost:56036/tests/dromaeo/cssquery-prototype.html) 05:33:52 INFO - PROCESS | 18599 | RSS: Main: 165908480 05:33:52 INFO - PROCESS | 18599 | 05:36:54 INFO - PROCESS | 18599 | Cycle 1(1): loaded http://localhost:56036/tests/dromaeo/cssquery-prototype.html (next: http://localhost:56036/tests/dromaeo/cssquery-yui.html) 05:36:55 INFO - PROCESS | 18599 | RSS: Main: 167002112 05:36:55 INFO - PROCESS | 18599 | 05:39:57 INFO - PROCESS | 18599 | Cycle 1(1): loaded http://localhost:56036/tests/dromaeo/cssquery-yui.html (next: http://localhost:56036/tests/dromaeo/cssquery-dojo.html) 05:39:58 INFO - PROCESS | 18599 | RSS: Main: 168718336 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - PROCESS | 18599 | __start_tp_report 05:39:58 INFO - PROCESS | 18599 | _x_x_mozilla_page_load 05:39:58 INFO - PROCESS | 18599 | _x_x_mozilla_page_load_details 05:39:58 INFO - PROCESS | 18599 | |i|pagename|runs| 05:39:58 INFO - PROCESS | 18599 | |0;dojo.html;3146.8269245191514;3200.0879749271453;3210.341879914618;3228.499582564702;3241.659625739299;5322.387925388577;5328.786848526054;5374.516293533581;5395.514403703666;5423.2136340230645;5388.541973932221;5393.81121660742;5407.215953686713;5471.097268950618;5508.118701007839;4882.755862206894;4911.091448082117;4957.776900039489;4965.900681986358;5006.098902197603;677.9754233909026;4877.609791216694;4895.461499235082;4960.231164169541;4967;4879.097366987119;4882;4892.510748925115;4893.339399181118;4903.141950158743;4881.194602890519;4887.877803054952;4899.975500122512;4922.778474968635;4936.3829521309835;4780.235162374003;4895.7062576245535;4934.087193869145;4966.726830024347;4983.6760610560195;5290.523852853262;5302.469753024667;5319.20211968204;5345.973270133624;5412.296401467784;5650.660960342392;5786.566007549451;5802.535797136261;5812.331581868097;5816.505597024258;5751.051076572402;5756.539476841843;5785;5815.331236907768;5842.620229685057;5394.136938089887;5425;5426.430224826416;5431.375391829951;5432.75552600134;5918.7928422505;5925.674087925119;5925.851853703605;5926.733297001645;5947.226860508193;5632.887342253132;5654.660720356792;5672.4894759471845;5676.602637815313;5681.801136960186;5760.049591817387;5762.250907382014;5762.30852297727;5767.913481297784;5769.249997500298;5664.433556644302;5721.771129154788;5727.885442291131;5796.5072968797285;5864.941350586525;5721.141828725641;5751.884962300731;5759.971200143972;5770.826875193751;5812;4293.592108749664;4332.891677708082;4337.544557821447;4340.891477713082;4382.496012958487;3847.442120892455;3914.0214946263436;3920.5491368492417;3931.901702457404;3986.202759448122;5432.429594892558;5482.753276102585;5511.173324001432;5514.91727624086;5571.777128914879;5751.338596061423;5793.536517078708;5799;5799.739011744482;5805.274340707411;5446.264754258124;5500.972495137498;5550.7779688812;5617.550595952314;5643.238162847963;4964.15609346412;4975.278584605212;4993.975030124899;5009.849704508871;5051.419086805065;6025.276966763929;6050.697465126814;6078.209832721806;6078.483328917092;6086.087086936906;5652.3217213934595;5719.399463056486;5765.192872997867;5820;5825.300963884361;5942.257217847769;5952.910706339322;5977.103434484862;5982.551308651781;5989;5644.604877658525;5722.2561067061015;5725.2843394575675;5745.511631511368;5759;5751.396103409082;5759.625624334405;5785.595008349375;5802.0426629605645;5837.67892765885;5595.384507704068;5630.718464076862;5635.943640563706;5652.208690783212;5665.575081868794;5548.334199896039;5579.609427340048;5638.041532939492;5645.971770141123;5699.259096317618;5594.188842617879;5603.0474819281635;5624.240727501735;5638.154276858504;5662.03745363281;5646.689432081275;5653.632513886584;5674.858128546819;5686.317641883001;5706.9714651426475;5409.459054094559;5520.641158324696;5540.501354878081;5547.195656629686;5604.85987850307 05:39:58 INFO - PROCESS | 18599 | |1;ext.html;602.2351613450918;652.2140820311525;653.3335997282771;659.7888675623801;683.0846665468272;37458.250834983286;38704.80647596765;38792.03019924503;38802.61197388025;38806.41790373147;39280.607193928125;39826.80086599563;40021.39967900484;40179.397309040316;40257.19485610286;8439.451435656694;8558.572071396406;8565.828683426327;8595.140485951386;8622.180892815204;8452.915470845275;8640.2223799858;8727.38908276421;8784.29725621952;8823.250023747989;8737.257333126692;8840.778980525507;8886.955565222164;8895.510746908918;8895.95552022239;8722.21500064994;8741.606627701705;8800.251978581828;8807.383483156182;8822.11778822119;8353.457025293397;8391.580420978988;8460.365472589581;8539;8543.35924805642;28307.292317692016;39884;40146;40219;40334.79832600818;3176.2059485128716;3332.8333583320737;3377.2529149502907;3390.423627983249;3399.3711163434846;29735.25661858449;30014.298713115706;30175.396492070035;30617.846910765304;31067.689323106933;4283.293256612656;4292.660614316831;4343.956560434419;4344.391785150082;4350.195213885441;252351;259340;260295;260878;341548;34254.82872585621;64651.35348646453;65976.67011664911;66068.66965665141;66107;37142.62857371446;37188.25623487515;37298.627013729514;37513.62486375156;37548.62451375506;15194.468193613391;15344.462943797136;15399;15418.229088545528;15421.922890385476;12641.2415255085;12691.873081269254;12696.682582935317;12732.554360597334;12757.617271481684;8622.137786221328;8674.956625216833;8680.69617563395;8795.824083518293;8827.823443531222;3351.4470112431663;3396.1339858335964;3421.418358878947;3433.3305005523684;3434.6737059979264;1034.736142283728;1047.2302857399804;1068.6206396729206;1069.0165048155716;1087.6465148826662;27610.723892761216;27687.723122768515;27786.3053423662;27829.443411131662;29801.10596682103;1063.3301020357126;1081.5241293830688;1091.8034753744244;1100.5982816272003;1260.2249616485979;15252.466163684217;15445.922770386076;15605;15931.283092260875;15976.440824571084;473510;479822;479893;482218;483407;57274;58909.41090589039;59018.70490647519;59021.40978590159;59120.40879591149;1289.6324547503916;1351.0407610596587;1351.6350585341902;1369;1372.6499742565782;29966;30482;30703.692963070083;30709.24786435855;31304.686953131088;48931.510684892695;49369.506304937924;49488.25767613561;49552.256716148564;49619.25571116508;340628;345766;346927;347459;348262;28348.433031338845;28899.277518061375;28988.275293116996;29012.27469313284;29016.259024457755;47172.528274718185;47883;48447.27329090137;48483.27275090806;49065.754671226416;40405.12046687776;40994.79502602468;41143;41791.7910410446;42166.15667686691;35996.64003359933;36522;36671.44992825163;36789;40552.79723601481;35528;35982.10044748902;36384.09039773921;37219;37355.626443735215;32292.67707322991;34968.65031349654;35200.47199292064;35811.462828058124;36374;27328.72671273262;27490.17529474119;27495;27540.586891196246;27686.446271074063 05:39:58 INFO - PROCESS | 18599 | |2;jquery.html;387.41113507468646;388.41349562161145;390.99022524436896;392.2222331172843;399.22749479756675;17908.64182716345;18025.819741802577;18416.631667366644;18465.169067391947;19828;18273.634527309445;18513.81486185141;19016.524586885334;19024.524386890334;19044.428667139975;5363.9463605363835;5416.404195538487;5613.859653508654;5631.211630371751;5640.746166422521;5555.861103472405;5587.552995760329;5593.74828132735;5608.691521966291;5620.409856965021;5341.679499230039;5558.194061861028;5565.0817615093465;5595.916061259084;5605.047141985872;5502.944970550283;5538.972305138469;5544.16837474378;5546.195801608744;5585.804496842611;4767.189577771787;4817.060673168733;4833.85498435044;4852.175130227834;4961.5286547777905;22472;22486.66270005951;22507;23270.76729232703;23287.88356058209;2214.833887458431;2334.0780391745334;2430.6961629796274;2511.9120830770835;2554.363497161258;13564.796528052088;14403.135811851322;14468.855311446856;14587.48943786973;14651.267436628126;1908.961820763577;1974.2004488182165;1981.5244341358114;2048.6619707748205;2059.4336557446823;81222.59388703077;81484.77772833413;81890.59054704689;82400;82770;9830.459324737209;10060;10217.795644087226;10384.844227336596;10431.94784026075;13808.17150970945;13921.721565568834;14067.085639433404;14083.929580352033;14117.78823317651;7975.361971042303;8023.277904988579;8074.757757267292;8144.796380090426;8180.918190818015;8032.437729359006;8113.269805717514;8151.79620509492;8264.462809917337;8288;6208.72060757267;6285.622862628165;6396.680165991682;6404.231492220963;6405.711742971577;1833.8446778529442;1845.593969326746;1868.7664041994751;1869.4017914267577;1886.8962207078469;982.5624873093831;1004.6584161385164;1019.6482213636284;1097.9788796419407;1156.9132315076404;19316.420507384802;19476.4157075288;19478;19499.61000780005;19726.40820775379;979.480875136179;998.3161534348849;1006.059334522224;1024.7694268789462;1046.199657262195;10837.512311945982;11131.72170695739;11149.554017839358;11245.437728113562;11253.549858005588;459470;482475;498582;515552;523569;84138.57930710308;86311.56844215738;86786;87354;87371;993.1558175550869;1014.1227837920294;1056.4031322302874;1064.6646306413609;1082.2045796339685;16212.432564860173;16441.67116657684;16677.666446671243;16930.49208523697;17165.914170429067;35772.64227357693;40808.59191408167;42190.1561968765;43931.560684392745;43941;44544;55338;55483.72258138845;55611.44388556063;56024.719876400355;6744.62904540255;7756.146823849259;8010.359171266401;8274.710385136732;8734.65061397537;9604.807903842024;12395;13276.867231327564;13310.401031953392;13475.124116932368;11427;11556.364399957747;11597.246178998337;11835.467403967014;12377.566785162477;6633.734650614115;10427.478626068514;11405.258658187191;12110;12245.081618878441;12432.75134497323;12578.496860125859;12580.245185288912;12594.87405125937;12881.871181288067;8511.74464766058;8569.357298202784;8586.527740974307;8621.956890215508;8705.085965973482;12203.450844711831;12253.571125010581;12256.080793940311;12308.507659693512;12368.876311237133 05:39:58 INFO - PROCESS | 18599 | |3;mootools.html;1532.770084487327;1559.2515592515592;1698.957526061849;1776.3782676063372;1839.025316582211;7477.551346919188;7872.606369681522;8010.439269251155;8354.624041918112;8425.662973481054;7990.161033091515;8087.555184464852;8096.919030809705;8106.635201415936;8145.104038555754;2189.135291559829;2215.7784221577876;2226.4100013496436;2230.174835310929;2231.739067426907;2187.4312678703573;2212.325240801555;2214.2914267434426;2229.342344008521;2229.5429436965383;2227.3095340444434;2228.7882651148116;2232.1294695068937;2248.7413947396094;2259.039908039085;2173.3262688566438;2195.8133558647532;2197.626403511399;2199.1753092590357;2202.922897698581;2174.706414634036;2174.923877664274;2180.9781902180935;2182.334388011656;2193.100828660242;8212.137725538792;8248.092709801916;8282.627281772335;8284.585770711441;8320.417570770049;4700.741459219742;4859.2954021666665;4864.902701945941;4886.096072226649;4892.168331383673;2993.9401211975637;3166.794158379698;3174.6507884132725;3175.1744546417867;3185.697358750915;971.4220039076738;976.858355538443;993.4138858073699;1028.5577201803221;1036.6889933020138;11187.608433704863;11266.887331126665;11288.774224515546;11317.773644527064;11370.602028928948;4244.72409293395;4332.1119170569955;4392.4289842320295;4395.208862404797;4418.116376724668;9851.261155413373;9852.80294394108;9871.160951319218;9896.25778066648;9910.454924979196;4993.375828021497;5048.217526283432;5131.2559678846355;5143.485651434827;5147.176451767774;4036;4529.433820772403;4619.514950930171;4639.86080417588;4682.4381074271305;3729.4405839123806;3890.688744900401;3890.9416358754643;3911.6088391160656;3915.530136383652;1227.8281040654315;1251.9123661343801;1257.478146569182;1261.2999785119164;1276.9720375098136;993.2401712689798;995.5221493682928;1000.8949060348705;1009.8889122196553;1012.549415510091;5613.831585052455;5676.233708449389;5728.54171666274;5755.050416681201;5916.668749531407;965.9372140810825;975.9365641233439;998.7353351361895;1011.716719318592;1040.2822052783556;3915.197384536163;3939.074317535377;3940.0346915006007;3974.8608798692485;3977.6134319408125;9634.229261659051;10052;10071.597136114473;10106.797864042825;10164.186865050779;9940.353876997971;10192.796144077225;10198.694039178836;10201.99999999985;10210.795784084277;7709.267619576131;7851.136374998746;7883.329916957008;7901.486403383762;7939;5459.262999495176;5569.944300557105;5647;5655.85860353478;5669.34802497718;9210.631574737203;9277.953610231905;9487.810243794947;9556.90443095588;9611.279154063614;9382.859257111013;9699.854502182332;9759.756006099904;9898.851517227104;10027;7341.192468828318;7423.925760742323;7650.8087297818;7653.234676532302;7688.038995125609;8014.679412823421;8090.919090809017;8135.877961830695;8136.308413784658;8140.104588495143;7104.325089116525;7239.095113110861;7401.259874012556;7504.62476876165;7614.657340419583;7188.28117188277;7194.532355396883;7242.02232698579;7266.636668166465;7391.2239214881665;6705.591825716654;6735.6295403753265;6735.932640673726;6766.05275261454;6778.389944904982;4980.975095124501;5016.347874776402;5062.683702237518;5158.509941555546;5204.453532379197;5156.871078223075;5238.214267859851;5262.789488420573;5288.497592728685;5299.284596579567 05:39:58 INFO - PROCESS | 18599 | |4;prototype.html;319.10172863389545;324.8343344894104;326.9133679574913;327.8655751142031;332.6191510720227;5406.91889621656;5408.567314614831;5464.781408743651;5594.608377413582;5632.01439748044;5464.12573988162;5491.560675145989;5516.91724624131;5539.446055394458;5540.030494663438;4261.509926358477;4288.592583704543;4308.482982042159;4308.870733877989;4310.956890431103;4222.074137433734;4336.436263285768;4343.6959412841115;4347.956490442287;4351.151525452538;4230.344296634026;4283.357496375553;4289.077848262623;4303.526612072669;4315.892102697427;4279.957200427987;4285.571442855705;4301.6343610792965;4324.005478739876;4337.327714204272;3635.654612811779;3800.9167387294488;3807.1814559869763;3811.942820857689;3819.9045023874346;5215.817446389358;5263.763130659091;5280.973595132038;5292.41227631709;5333.546648534879;4818.301346304801;4843.055604157191;4853.733044682541;4856.68431551948;4857.0814528261135;5603.7478313475995;5685.943140568583;5696.943030569682;5701.230333904953;5755.625884317506;4113.25961326961;4131.710780245384;4141.378793181017;4141.503019637663;4153.878452817752;5930.347661757203;6017.06735456005;6020.789272375446;6073.362296958844;6107.603005804653;4107.54816970133;4169.10364271683;4172.290710579148;4183.518895327076;4209.768462734579;4235.407043013919;4251.128518653669;4255.702100852911;4264.637505812041;4274.294741367702;4822.276658501253;4851.708897466164;4854.732989685601;4857.878553036202;4875.561199492063;5592.860178495489;5813.011787995966;5863.413658634103;5876.059830427112;5904.143899134601;1533.072491142865;1549.6590750034975;1549.9535013949373;1554.168519841879;1562.8671562917052;1016.425719468498;1031.7575369788094;1033.547865249326;1040.8178568750438;1042.3641578637025;6084.026555751058;6085.36103709113;6097.17688112108;6135.570510064342;6143.784967526115;6342;6360.840978975562;6367.395097465734;6393.529488217643;6435.935640643627;5985.880282394415;6032.125341825498;6062.575619706578;6079.392060793885;6094.725737341831;3386.390449719025;3393.830308484566;3412.112850658797;3418.9487157692656;3425.4861770734587;6483.384078512534;6573.276939536647;6575.704093315812;6600.471962243009;6664.03410993758;6457.1282876811965;6460.3862633049785;6489.3510648934725;6534.771283005072;6538.248101468297;6449.355064493513;6512.674366281667;6574.474042076622;6583.572067815577;6620.5765760361755;6386.393292637192;6392.264889537762;6395.744170233324;6413.16628838248;6431.1317972073175;6064.696765161812;6298.433141017331;6316.147320111726;6338.746450141943;6369.49044076482;5858.2677165354335;6539.247986481616;6592.505562082767;6624.8343791405605;6630.801075967729;4095.9760059985006;4276;4289;4304.4834619845815;4308.289132293136;5910.615809972338;5961.225040744675;5969.761209551743;5973.402659733992;6049.759799241057;5649.774009039593;5750.166225897305;5756.366799651951;5782.421757824184;5804.970975145097;5695.45893140151;5774.249347584787;5790.826275211751;5805.332386775406;5806;5646.322441307069;5651.858703532444;5679.484809576479;5681.147827825859;5686.34607020198;5572.637778544382;5764.769409223584;5827.70861456917;5828.708564571839;5828.901595425728;5609.467100625434;5617.8033768817895;5632.971835140798;5657.32112146545;5670.518005969374 05:39:58 INFO - PROCESS | 18599 | |5;yui.html;694.2710154337946;806.7579726082178;812.2121542104164;817.7873752824264;819.6311659753112;12603.117781755269;13153.802692959602;13211.537596184147;13309.80035299469;13313.201207927532;11970.461329240183;12012.45943932523;12026.639200823967;12027.458764355602;12066.577669781538;661.8312330355752;787.6967367563471;790.8378782349619;811.4968719393984;815.2784785464877;808.9878651820227;810.5582457560614;813.4265342933218;813.6704634622987;814.287498438866;844.957752112395;846.5090247656344;852.86780549015;855.1320409784043;859.0593300336122;839.6347588798861;845.5011543189516;846.2764336492272;848.758103940374;849.2569002123142;623.6756886419082;626.7242413338116;628.9245290565116;629.2637613991641;630.6373835044867;11951.984081353008;12048.156629035971;12074.577389791402;12086.670466248706;12145.939270303681;13686.931565342109;14098;14180.14919104857;14198.645033874132;14253.50112746049;10887.618933337295;10965.61620343284;11106.333619982826;11239.100871930308;11455.541778328858;3781.1681430085337;3886.125621735115;3947.842086316544;3951.7628942263555;4044.029432936074;53919.73040134774;54122.45877541214;54943.17585236225;55315.72342138264;55396.446035539935;10954.287971281841;10992.835107473395;11025.257519366742;11074.889251107386;11125.388103654215;20443.795562044488;20458.38624841257;20573.79426205719;20629;20634.79365206359;8367.58162091905;8414.873776893352;8503.872441913376;8508.617112229964;8554.743357699279;4593.54064593538;4669.906601867943;4697.95302046982;4699.989502257031;4765.642576806753;3429.742769292313;3435.158386195348;3460.0657822388316;3472.8958131256104;3488.4418493040994;608.330836080317;609.4332270987935;617.7251123250201;626.7148447456397;627.7802769030802;504.44511037858064;564.2354609504144;582.0715958046908;587.7325816753367;609.7225762278152;8717.738467845975;8980.506072166094;8983.46099234048;9025.864612030824;9065.682701105561;619.553921176752;620.3703241210176;662.3872917551342;678.3928384096305;735.1766022055225;4069.918601627951;4156.106437116035;4157.542670306264;4159.230542349675;4194.6853985951175;64999.35000650027;65422.672886635264;65473.34526654768;65720.67139664367;66913;53318.466815332125;53390.19914701283;53676;54142;55148;50503.74748126309;50736.49263507391;51146.48853511417;51429.742851285504;51448.74275628598;7623.618819058914;7902.209779022051;7943.086545047162;7955.1249362571225;8077.959610201911;31377.529337059506;32712.672873270963;32864.67135328616;33182.83408582942;33898.152546186546;46422.7678861617;47285.52714472811;47472;47762.28356574724;47783.761081194374;11320.660380188607;11325.263857849213;11345.546178152781;11581.942090289494;11844.407779611158;12018.459169337575;12611.43248553799;12705.936470317589;13579;13854.792178117135;11993.820092698443;12103.092268079754;12205.633830985085;12308.569200077955;12565.246085234916;12503.4373453193;12665.176763510342;12713.491460341484;12742;12830.166039207796;10640.787184256425;11536.307821530734;11930.463129159381;12015.519379225083;12040.277583345027;10174.8473772892;10549.314294570828;10836.295640783324;10969.561217551209;10978.780424391627;10578.841317380091;10721.731956701145;10722.839157412489;10808.56765729362;11024.228304018641 05:39:58 INFO - PROCESS | 18599 | __end_tp_report 05:39:58 INFO - PROCESS | 18599 | __start_cc_report 05:39:58 INFO - PROCESS | 18599 | _x_x_mozilla_cycle_collect,356 05:39:58 INFO - PROCESS | 18599 | __end_cc_report 05:39:58 INFO - PROCESS | 18599 | __startTimestamp1462192798029__endTimestamp 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - PROCESS | 18599 | ------- Summary: start ------- 05:39:58 INFO - PROCESS | 18599 | Number of tests: 6 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - PROCESS | 18599 | [#0] dojo.html Cycles:165 Average:5345.70 Median:5617.55 stddev:708.31 (12.6%) stddev-sans-first:689.16 05:39:58 INFO - PROCESS | 18599 | Values: 3146.8 3200.1 3210.3 3228.5 3241.7 5322.4 5328.8 5374.5 5395.5 5423.2 5388.5 5393.8 5407.2 5471.1 5508.1 4882.8 4911.1 4957.8 4965.9 5006.1 678.0 4877.6 4895.5 4960.2 4967.0 4879.1 4882.0 4892.5 4893.3 4903.1 4881.2 4887.9 4900.0 4922.8 4936.4 4780.2 4895.7 4934.1 4966.7 4983.7 5290.5 5302.5 5319.2 5346.0 5412.3 5650.7 5786.6 5802.5 5812.3 5816.5 5751.1 5756.5 5785.0 5815.3 5842.6 5394.1 5425.0 5426.4 5431.4 5432.8 5918.8 5925.7 5925.9 5926.7 5947.2 5632.9 5654.7 5672.5 5676.6 5681.8 5760.0 5762.3 5762.3 5767.9 5769.2 5664.4 5721.8 5727.9 5796.5 5864.9 5721.1 5751.9 5760.0 5770.8 5812.0 4293.6 4332.9 4337.5 4340.9 4382.5 3847.4 3914.0 3920.5 3931.9 3986.2 5432.4 5482.8 5511.2 5514.9 5571.8 5751.3 5793.5 5799.0 5799.7 5805.3 5446.3 5501.0 5550.8 5617.6 5643.2 4964.2 4975.3 4994.0 5009.8 5051.4 6025.3 6050.7 6078.2 6078.5 6086.1 5652.3 5719.4 5765.2 5820.0 5825.3 5942.3 5952.9 5977.1 5982.6 5989.0 5644.6 5722.3 5725.3 5745.5 5759.0 5751.4 5759.6 5785.6 5802.0 5837.7 5595.4 5630.7 5635.9 5652.2 5665.6 5548.3 5579.6 5638.0 5646.0 5699.3 5594.2 5603.0 5624.2 5638.2 5662.0 5646.7 5653.6 5674.9 5686.3 5707.0 5409.5 5520.6 5540.5 5547.2 5604.9 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - PROCESS | 18599 | [#1] ext.html Cycles:180 Average:52115.84 Median:37203.63 stddev:99935.00 (268.6%) stddev-sans-first:100140.50 05:39:58 INFO - PROCESS | 18599 | Values: 602.2 652.2 653.3 659.8 683.1 37458.3 38704.8 38792.0 38802.6 38806.4 39280.6 39826.8 40021.4 40179.4 40257.2 8439.5 8558.6 8565.8 8595.1 8622.2 8452.9 8640.2 8727.4 8784.3 8823.3 8737.3 8840.8 8887.0 8895.5 8896.0 8722.2 8741.6 8800.3 8807.4 8822.1 8353.5 8391.6 8460.4 8539.0 8543.4 28307.3 39884.0 40146.0 40219.0 40334.8 3176.2 3332.8 3377.3 3390.4 3399.4 29735.3 30014.3 30175.4 30617.8 31067.7 4283.3 4292.7 4344.0 4344.4 4350.2 252351.0 259340.0 260295.0 260878.0 341548.0 34254.8 64651.4 65976.7 66068.7 66107.0 37142.6 37188.3 37298.6 37513.6 37548.6 15194.5 15344.5 15399.0 15418.2 15421.9 12641.2 12691.9 12696.7 12732.6 12757.6 8622.1 8675.0 8680.7 8795.8 8827.8 3351.4 3396.1 3421.4 3433.3 3434.7 1034.7 1047.2 1068.6 1069.0 1087.6 27610.7 27687.7 27786.3 27829.4 29801.1 1063.3 1081.5 1091.8 1100.6 1260.2 15252.5 15445.9 15605.0 15931.3 15976.4 473510.0 479822.0 479893.0 482218.0 483407.0 57274.0 58909.4 59018.7 59021.4 59120.4 1289.6 1351.0 1351.6 1369.0 1372.6 29966.0 30482.0 30703.7 30709.2 31304.7 48931.5 49369.5 49488.3 49552.3 49619.3 340628.0 345766.0 346927.0 347459.0 348262.0 28348.4 28899.3 28988.3 29012.3 29016.3 47172.5 47883.0 48447.3 48483.3 49065.8 40405.1 40994.8 41143.0 41791.8 42166.2 35996.6 36522.0 36671.4 36789.0 40552.8 35528.0 35982.1 36384.1 37219.0 37355.6 32292.7 34968.7 35200.5 35811.5 36374.0 27328.7 27490.2 27495.0 27540.6 27686.4 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - PROCESS | 18599 | [#2] jquery.html Cycles:180 Average:28902.03 Median:2471.30 stddev:81685.33 (3305.4%) stddev-sans-first:81886.42 05:39:58 INFO - PROCESS | 18599 | Values: 387.4 388.4 391.0 392.2 399.2 17908.6 18025.8 18416.6 18465.2 19828.0 18273.6 18513.8 19016.5 19024.5 19044.4 5363.9 5416.4 5613.9 5631.2 5640.7 5555.9 5587.6 5593.7 5608.7 5620.4 5341.7 5558.2 5565.1 5595.9 5605.0 5502.9 5539.0 5544.2 5546.2 5585.8 4767.2 4817.1 4833.9 4852.2 4961.5 22472.0 22486.7 22507.0 23270.8 23287.9 2214.8 2334.1 2430.7 2511.9 2554.4 13564.8 14403.1 14468.9 14587.5 14651.3 1909.0 1974.2 1981.5 2048.7 2059.4 81222.6 81484.8 81890.6 82400.0 82770.0 9830.5 10060.0 10217.8 10384.8 10431.9 13808.2 13921.7 14067.1 14083.9 14117.8 7975.4 8023.3 8074.8 8144.8 8180.9 8032.4 8113.3 8151.8 8264.5 8288.0 6208.7 6285.6 6396.7 6404.2 6405.7 1833.8 1845.6 1868.8 1869.4 1886.9 982.6 1004.7 1019.6 1098.0 1156.9 19316.4 19476.4 19478.0 19499.6 19726.4 979.5 998.3 1006.1 1024.8 1046.2 10837.5 11131.7 11149.6 11245.4 11253.5 459470.0 482475.0 498582.0 515552.0 523569.0 84138.6 86311.6 86786.0 87354.0 87371.0 993.2 1014.1 1056.4 1064.7 1082.2 16212.4 16441.7 16677.7 16930.5 17165.9 35772.6 40808.6 42190.2 43931.6 43941.0 44544.0 55338.0 55483.7 55611.4 56024.7 6744.6 7756.1 8010.4 8274.7 8734.7 9604.8 12395.0 13276.9 13310.4 13475.1 11427.0 11556.4 11597.2 11835.5 12377.6 6633.7 10427.5 11405.3 12110.0 12245.1 12432.8 12578.5 12580.2 12594.9 12881.9 8511.7 8569.4 8586.5 8622.0 8705.1 12203.5 12253.6 12256.1 12308.5 12368.9 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - PROCESS | 18599 | [#3] mootools.html Cycles:180 Average:5504.84 Median:5096.97 stddev:3060.21 (60.0%) stddev-sans-first:3054.24 05:39:58 INFO - PROCESS | 18599 | Values: 1532.8 1559.3 1699.0 1776.4 1839.0 7477.6 7872.6 8010.4 8354.6 8425.7 7990.2 8087.6 8096.9 8106.6 8145.1 2189.1 2215.8 2226.4 2230.2 2231.7 2187.4 2212.3 2214.3 2229.3 2229.5 2227.3 2228.8 2232.1 2248.7 2259.0 2173.3 2195.8 2197.6 2199.2 2202.9 2174.7 2174.9 2181.0 2182.3 2193.1 8212.1 8248.1 8282.6 8284.6 8320.4 4700.7 4859.3 4864.9 4886.1 4892.2 2993.9 3166.8 3174.7 3175.2 3185.7 971.4 976.9 993.4 1028.6 1036.7 11187.6 11266.9 11288.8 11317.8 11370.6 4244.7 4332.1 4392.4 4395.2 4418.1 9851.3 9852.8 9871.2 9896.3 9910.5 4993.4 5048.2 5131.3 5143.5 5147.2 4036.0 4529.4 4619.5 4639.9 4682.4 3729.4 3890.7 3890.9 3911.6 3915.5 1227.8 1251.9 1257.5 1261.3 1277.0 993.2 995.5 1000.9 1009.9 1012.5 5613.8 5676.2 5728.5 5755.1 5916.7 965.9 975.9 998.7 1011.7 1040.3 3915.2 3939.1 3940.0 3974.9 3977.6 9634.2 10052.0 10071.6 10106.8 10164.2 9940.4 10192.8 10198.7 10202.0 10210.8 7709.3 7851.1 7883.3 7901.5 7939.0 5459.3 5569.9 5647.0 5655.9 5669.3 9210.6 9278.0 9487.8 9556.9 9611.3 9382.9 9699.9 9759.8 9898.9 10027.0 7341.2 7423.9 7650.8 7653.2 7688.0 8014.7 8090.9 8135.9 8136.3 8140.1 7104.3 7239.1 7401.3 7504.6 7614.7 7188.3 7194.5 7242.0 7266.6 7391.2 6705.6 6735.6 6735.9 6766.1 6778.4 4981.0 5016.3 5062.7 5158.5 5204.5 5156.9 5238.2 5262.8 5288.5 5299.3 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - PROCESS | 18599 | [#4] prototype.html Cycles:180 Average:4985.85 Median:5599.18 stddev:1510.02 (27.0%) stddev-sans-first:1473.07 05:39:58 INFO - PROCESS | 18599 | Values: 319.1 324.8 326.9 327.9 332.6 5406.9 5408.6 5464.8 5594.6 5632.0 5464.1 5491.6 5516.9 5539.4 5540.0 4261.5 4288.6 4308.5 4308.9 4311.0 4222.1 4336.4 4343.7 4348.0 4351.2 4230.3 4283.4 4289.1 4303.5 4315.9 4280.0 4285.6 4301.6 4324.0 4337.3 3635.7 3800.9 3807.2 3811.9 3819.9 5215.8 5263.8 5281.0 5292.4 5333.5 4818.3 4843.1 4853.7 4856.7 4857.1 5603.7 5685.9 5696.9 5701.2 5755.6 4113.3 4131.7 4141.4 4141.5 4153.9 5930.3 6017.1 6020.8 6073.4 6107.6 4107.5 4169.1 4172.3 4183.5 4209.8 4235.4 4251.1 4255.7 4264.6 4274.3 4822.3 4851.7 4854.7 4857.9 4875.6 5592.9 5813.0 5863.4 5876.1 5904.1 1533.1 1549.7 1550.0 1554.2 1562.9 1016.4 1031.8 1033.5 1040.8 1042.4 6084.0 6085.4 6097.2 6135.6 6143.8 6342.0 6360.8 6367.4 6393.5 6435.9 5985.9 6032.1 6062.6 6079.4 6094.7 3386.4 3393.8 3412.1 3418.9 3425.5 6483.4 6573.3 6575.7 6600.5 6664.0 6457.1 6460.4 6489.4 6534.8 6538.2 6449.4 6512.7 6574.5 6583.6 6620.6 6386.4 6392.3 6395.7 6413.2 6431.1 6064.7 6298.4 6316.1 6338.7 6369.5 5858.3 6539.2 6592.5 6624.8 6630.8 4096.0 4276.0 4289.0 4304.5 4308.3 5910.6 5961.2 5969.8 5973.4 6049.8 5649.8 5750.2 5756.4 5782.4 5805.0 5695.5 5774.2 5790.8 5805.3 5806.0 5646.3 5651.9 5679.5 5681.1 5686.3 5572.6 5764.8 5827.7 5828.7 5828.9 5609.5 5617.8 5633.0 5657.3 5670.5 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - PROCESS | 18599 | [#5] yui.html Cycles:180 Average:14726.16 Median:25508.15 stddev:17476.04 (68.5%) stddev-sans-first:17493.30 05:39:58 INFO - PROCESS | 18599 | Values: 694.3 806.8 812.2 817.8 819.6 12603.1 13153.8 13211.5 13309.8 13313.2 11970.5 12012.5 12026.6 12027.5 12066.6 661.8 787.7 790.8 811.5 815.3 809.0 810.6 813.4 813.7 814.3 845.0 846.5 852.9 855.1 859.1 839.6 845.5 846.3 848.8 849.3 623.7 626.7 628.9 629.3 630.6 11952.0 12048.2 12074.6 12086.7 12145.9 13686.9 14098.0 14180.1 14198.6 14253.5 10887.6 10965.6 11106.3 11239.1 11455.5 3781.2 3886.1 3947.8 3951.8 4044.0 53919.7 54122.5 54943.2 55315.7 55396.4 10954.3 10992.8 11025.3 11074.9 11125.4 20443.8 20458.4 20573.8 20629.0 20634.8 8367.6 8414.9 8503.9 8508.6 8554.7 4593.5 4669.9 4698.0 4700.0 4765.6 3429.7 3435.2 3460.1 3472.9 3488.4 608.3 609.4 617.7 626.7 627.8 504.4 564.2 582.1 587.7 609.7 8717.7 8980.5 8983.5 9025.9 9065.7 619.6 620.4 662.4 678.4 735.2 4069.9 4156.1 4157.5 4159.2 4194.7 64999.4 65422.7 65473.3 65720.7 66913.0 53318.5 53390.2 53676.0 54142.0 55148.0 50503.7 50736.5 51146.5 51429.7 51448.7 7623.6 7902.2 7943.1 7955.1 8078.0 31377.5 32712.7 32864.7 33182.8 33898.2 46422.8 47285.5 47472.0 47762.3 47783.8 11320.7 11325.3 11345.5 11581.9 11844.4 12018.5 12611.4 12705.9 13579.0 13854.8 11993.8 12103.1 12205.6 12308.6 12565.2 12503.4 12665.2 12713.5 12742.0 12830.2 10640.8 11536.3 11930.5 12015.5 12040.3 10174.8 10549.3 10836.3 10969.6 10978.8 10578.8 10721.7 10722.8 10808.6 11024.2 05:39:58 INFO - PROCESS | 18599 | -------- Summary: end -------- 05:39:58 INFO - PROCESS | 18599 | 05:39:58 INFO - TEST-INFO | 18599: exit 0 05:39:58 INFO - TEST-OK | dromaeo_css | took 1109762ms 05:39:58 INFO - TEST-START | kraken 05:39:58 INFO - operating with platform_type : linux_ 05:39:58 INFO - Initialising browser for kraken test... 05:39:58 INFO - TEST-INFO | started process 18830 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpO6w83r/profile http://localhost:56036/getInfo.html) 05:40:02 INFO - PROCESS | 18830 | 05:40:02 INFO - PROCESS | 18830 | (process:18901): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:40:03 INFO - PROCESS | 18830 | __metrics Screen width/height:1600/1200 05:40:03 INFO - PROCESS | 18830 | colorDepth:24 05:40:03 INFO - PROCESS | 18830 | Browser inner width/height: 1024/697 05:40:03 INFO - PROCESS | 18830 | __metrics 05:40:04 ERROR - PROCESS | 18830 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 05:40:04 INFO - TEST-INFO | 18830: exit 0 05:40:04 INFO - Browser initialized. 05:40:04 INFO - Running cycle 1/1 for kraken test... 05:40:04 INFO - TEST-INFO | started process 18952 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpO6w83r/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:40:06 INFO - PROCESS | 18952 | 05:40:06 INFO - PROCESS | 18952 | (process:19015): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:40:16 INFO - PROCESS | 18952 | RSS: Main: 164810752 05:40:16 INFO - PROCESS | 18952 | 05:40:19 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:56036/tests/kraken/driver.html?testName=audio-beat-detection) 05:40:20 INFO - PROCESS | 18952 | RSS: Main: 169451520 05:40:20 INFO - PROCESS | 18952 | 05:40:22 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:56036/tests/kraken/driver.html?testName=audio-dft) 05:40:23 INFO - PROCESS | 18952 | RSS: Main: 173805568 05:40:23 INFO - PROCESS | 18952 | 05:40:26 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:56036/tests/kraken/driver.html?testName=audio-fft) 05:40:26 INFO - PROCESS | 18952 | RSS: Main: 165765120 05:40:26 INFO - PROCESS | 18952 | 05:40:29 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:56036/tests/kraken/driver.html?testName=audio-oscillator) 05:40:29 INFO - PROCESS | 18952 | RSS: Main: 165855232 05:40:29 INFO - PROCESS | 18952 | 05:40:32 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:56036/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:40:32 INFO - PROCESS | 18952 | RSS: Main: 166051840 05:40:32 INFO - PROCESS | 18952 | 05:40:35 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:56036/tests/kraken/driver.html?testName=imaging-darkroom) 05:40:36 INFO - PROCESS | 18952 | RSS: Main: 166174720 05:40:36 INFO - PROCESS | 18952 | 05:40:39 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:56036/tests/kraken/driver.html?testName=imaging-desaturate) 05:40:40 INFO - PROCESS | 18952 | RSS: Main: 166502400 05:40:40 INFO - PROCESS | 18952 | 05:40:43 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:56036/tests/kraken/driver.html?testName=json-parse-financial) 05:40:43 INFO - PROCESS | 18952 | RSS: Main: 166658048 05:40:43 INFO - PROCESS | 18952 | 05:40:45 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:56036/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:40:46 INFO - PROCESS | 18952 | RSS: Main: 166801408 05:40:46 INFO - PROCESS | 18952 | 05:40:47 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:56036/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:40:48 INFO - PROCESS | 18952 | RSS: Main: 166920192 05:40:48 INFO - PROCESS | 18952 | 05:40:50 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:56036/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:40:51 INFO - PROCESS | 18952 | RSS: Main: 167018496 05:40:51 INFO - PROCESS | 18952 | 05:40:53 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:56036/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:40:54 INFO - PROCESS | 18952 | RSS: Main: 167231488 05:40:54 INFO - PROCESS | 18952 | 05:40:57 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:56036/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:40:58 INFO - PROCESS | 18952 | RSS: Main: 167374848 05:40:58 INFO - PROCESS | 18952 | 05:40:59 INFO - PROCESS | 18952 | Cycle 1(1): loaded http://localhost:56036/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:56036/tests/kraken/driver.html?testName=ai-astar) 05:41:00 INFO - PROCESS | 18952 | RSS: Main: 168177664 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | __start_tp_report 05:41:00 INFO - PROCESS | 18952 | _x_x_mozilla_page_load 05:41:00 INFO - PROCESS | 18952 | _x_x_mozilla_page_load_details 05:41:00 INFO - PROCESS | 18952 | |i|pagename|runs| 05:41:00 INFO - PROCESS | 18952 | |0;ai-astar;112;107;115;112;113;124;113;112;112;111 05:41:00 INFO - PROCESS | 18952 | |1;audio-beat-detection;166;135;153;184;132;156;157;131;203;130 05:41:00 INFO - PROCESS | 18952 | |2;audio-dft;162;163;161;162;159;166;175;165;166;162 05:41:00 INFO - PROCESS | 18952 | |3;audio-fft;77;80;80;166;78;79;76;79;168;79 05:41:00 INFO - PROCESS | 18952 | |4;audio-oscillator;93;93;142;92;95;94;146;93;93;145 05:41:00 INFO - PROCESS | 18952 | |5;imaging-gaussian-blur;117;117;117;118;117;118;117;117;118;118 05:41:00 INFO - PROCESS | 18952 | |6;imaging-darkroom;146;145;146;146;147;147;146;146;146;148 05:41:00 INFO - PROCESS | 18952 | |7;imaging-desaturate;95;100;95;96;94;95;95;96;95;96 05:41:00 INFO - PROCESS | 18952 | |8;json-parse-financial;60;58;57;59;58;58;58;78;57;55 05:41:00 INFO - PROCESS | 18952 | |9;json-stringify-tinderbox;62;64;67;64;63;63;63;63;63;63 05:41:00 INFO - PROCESS | 18952 | |10;stanford-crypto-aes;77;85;78;81;80;80;84;83;83;80 05:41:00 INFO - PROCESS | 18952 | |11;stanford-crypto-ccm;131;128;136;126;126;123;135;125;162;128 05:41:00 INFO - PROCESS | 18952 | |12;stanford-crypto-pbkdf2;171;171;179;169;181;181;172;171;175;171 05:41:00 INFO - PROCESS | 18952 | |13;stanford-crypto-sha256-iterative;69;71;70;73;73;70;69;75;70;70 05:41:00 INFO - PROCESS | 18952 | __end_tp_report 05:41:00 INFO - PROCESS | 18952 | __start_cc_report 05:41:00 INFO - PROCESS | 18952 | _x_x_mozilla_cycle_collect,845 05:41:00 INFO - PROCESS | 18952 | __end_cc_report 05:41:00 INFO - PROCESS | 18952 | __startTimestamp1462192860022__endTimestamp 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | ------- Summary: start ------- 05:41:00 INFO - PROCESS | 18952 | Number of tests: 14 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#0] ai-astar Cycles:10 Average:113.10 Median:112.50 stddev:4.33 (3.9%) stddev-sans-first:4.58 05:41:00 INFO - PROCESS | 18952 | Values: 112.0 107.0 115.0 112.0 113.0 124.0 113.0 112.0 112.0 111.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#1] audio-beat-detection Cycles:10 Average:154.70 Median:156.50 stddev:24.50 (15.7%) stddev-sans-first:25.65 05:41:00 INFO - PROCESS | 18952 | Values: 166.0 135.0 153.0 184.0 132.0 156.0 157.0 131.0 203.0 130.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#2] audio-dft Cycles:10 Average:164.10 Median:164.00 stddev:4.43 (2.7%) stddev-sans-first:4.64 05:41:00 INFO - PROCESS | 18952 | Values: 162.0 163.0 161.0 162.0 159.0 166.0 175.0 165.0 166.0 162.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#3] audio-fft Cycles:10 Average:96.20 Median:79.00 stddev:37.34 (47.3%) stddev-sans-first:38.95 05:41:00 INFO - PROCESS | 18952 | Values: 77.0 80.0 80.0 166.0 78.0 79.0 76.0 79.0 168.0 79.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#4] audio-oscillator Cycles:10 Average:108.60 Median:93.00 stddev:24.69 (26.5%) stddev-sans-first:25.53 05:41:00 INFO - PROCESS | 18952 | Values: 93.0 93.0 142.0 92.0 95.0 94.0 146.0 93.0 93.0 145.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#5] imaging-gaussian-blur Cycles:10 Average:117.40 Median:117.50 stddev:0.52 (0.4%) stddev-sans-first:0.53 05:41:00 INFO - PROCESS | 18952 | Values: 117.0 117.0 117.0 118.0 117.0 118.0 117.0 117.0 118.0 118.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#6] imaging-darkroom Cycles:10 Average:146.30 Median:146.00 stddev:0.82 (0.6%) stddev-sans-first:0.87 05:41:00 INFO - PROCESS | 18952 | Values: 146.0 145.0 146.0 146.0 147.0 147.0 146.0 146.0 146.0 148.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:95.00 stddev:1.64 (1.7%) stddev-sans-first:1.72 05:41:00 INFO - PROCESS | 18952 | Values: 95.0 100.0 95.0 96.0 94.0 95.0 95.0 96.0 95.0 96.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#8] json-parse-financial Cycles:10 Average:59.80 Median:58.00 stddev:6.53 (11.3%) stddev-sans-first:6.92 05:41:00 INFO - PROCESS | 18952 | Values: 60.0 58.0 57.0 59.0 58.0 58.0 58.0 78.0 57.0 55.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#9] json-stringify-tinderbox Cycles:10 Average:63.50 Median:63.00 stddev:1.35 (2.1%) stddev-sans-first:1.32 05:41:00 INFO - PROCESS | 18952 | Values: 62.0 64.0 67.0 64.0 63.0 63.0 63.0 63.0 63.0 63.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#10] stanford-crypto-aes Cycles:10 Average:81.10 Median:82.00 stddev:2.60 (3.2%) stddev-sans-first:2.30 05:41:00 INFO - PROCESS | 18952 | Values: 77.0 85.0 78.0 81.0 80.0 80.0 84.0 83.0 83.0 80.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#11] stanford-crypto-ccm Cycles:10 Average:132.00 Median:129.50 stddev:11.35 (8.8%) stddev-sans-first:12.04 05:41:00 INFO - PROCESS | 18952 | Values: 131.0 128.0 136.0 126.0 126.0 123.0 135.0 125.0 162.0 128.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:174.10 Median:173.50 stddev:4.58 (2.6%) stddev-sans-first:4.72 05:41:00 INFO - PROCESS | 18952 | Values: 171.0 171.0 179.0 169.0 181.0 181.0 172.0 171.0 175.0 171.0 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - PROCESS | 18952 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.00 Median:70.50 stddev:2.00 (2.8%) stddev-sans-first:1.99 05:41:00 INFO - PROCESS | 18952 | Values: 69.0 71.0 70.0 73.0 73.0 70.0 69.0 75.0 70.0 70.0 05:41:00 INFO - PROCESS | 18952 | -------- Summary: end -------- 05:41:00 INFO - PROCESS | 18952 | 05:41:00 INFO - TEST-INFO | 18952: exit 0 05:41:00 INFO - TEST-OK | kraken | took 62253ms 05:41:00 INFO - SUITE-END | took 1172s 05:41:01 INFO - Completed test suite (00:19:32) 05:41:01 INFO - javascript benchmark 05:41:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3146.8269245191514, 3200.0879749271453, 3210.341879914618, 3228.499582564702, 3241.659625739299, 5322.387925388577, 5328.786848526054, 5374.516293533581, 5395.514403703666, 5423.2136340230645, 5388.541973932221, 5393.81121660742, 5407.215953686713, 5471.097268950618, 5508.118701007839, 4882.755862206894, 4911.091448082117, 4957.776900039489, 4965.900681986358, 5006.098902197603, 677.9754233909026, 4877.609791216694, 4895.461499235082, 4960.231164169541, 4967.0, 4879.097366987119, 4882.0, 4892.510748925115, 4893.339399181118, 4903.141950158743, 4881.194602890519, 4887.877803054952, 4899.975500122512, 4922.778474968635, 4936.3829521309835, 4780.235162374003, 4895.7062576245535, 4934.087193869145, 4966.726830024347, 4983.6760610560195, 5290.523852853262, 5302.469753024667, 5319.20211968204, 5345.973270133624, 5412.296401467784, 5650.660960342392, 5786.566007549451, 5802.535797136261, 5812.331581868097, 5816.505597024258, 5751.051076572402, 5756.539476841843, 5785.0, 5815.331236907768, 5842.620229685057, 5394.136938089887, 5425.0, 5426.430224826416, 5431.375391829951, 5432.75552600134, 5918.7928422505, 5925.674087925119, 5925.851853703605, 5926.733297001645, 5947.226860508193, 5632.887342253132, 5654.660720356792, 5672.4894759471845, 5676.602637815313, 5681.801136960186, 5760.049591817387, 5762.250907382014, 5762.30852297727, 5767.913481297784, 5769.249997500298, 5664.433556644302, 5721.771129154788, 5727.885442291131, 5796.5072968797285, 5864.941350586525, 5721.141828725641, 5751.884962300731, 5759.971200143972, 5770.826875193751, 5812.0, 4293.592108749664, 4332.891677708082, 4337.544557821447, 4340.891477713082, 4382.496012958487, 3847.442120892455, 3914.0214946263436, 3920.5491368492417, 3931.901702457404, 3986.202759448122, 5432.429594892558, 5482.753276102585, 5511.173324001432, 5514.91727624086, 5571.777128914879, 5751.338596061423, 5793.536517078708, 5799.0, 5799.739011744482, 5805.274340707411, 5446.264754258124, 5500.972495137498, 5550.7779688812, 5617.550595952314, 5643.238162847963, 4964.15609346412, 4975.278584605212, 4993.975030124899, 5009.849704508871, 5051.419086805065, 6025.276966763929, 6050.697465126814, 6078.209832721806, 6078.483328917092, 6086.087086936906, 5652.3217213934595, 5719.399463056486, 5765.192872997867, 5820.0, 5825.300963884361, 5942.257217847769, 5952.910706339322, 5977.103434484862, 5982.551308651781, 5989.0, 5644.604877658525, 5722.2561067061015, 5725.2843394575675, 5745.511631511368, 5759.0, 5751.396103409082, 5759.625624334405, 5785.595008349375, 5802.0426629605645, 5837.67892765885, 5595.384507704068, 5630.718464076862, 5635.943640563706, 5652.208690783212, 5665.575081868794, 5548.334199896039, 5579.609427340048, 5638.041532939492, 5645.971770141123, 5699.259096317618, 5594.188842617879, 5603.0474819281635, 5624.240727501735, 5638.154276858504, 5662.03745363281, 5646.689432081275, 5653.632513886584, 5674.858128546819, 5686.317641883001, 5706.9714651426475, 5409.459054094559, 5520.641158324696, 5540.501354878081, 5547.195656629686, 5604.85987850307], "value": 5300.399955215404, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [602.2351613450918, 652.2140820311525, 653.3335997282771, 659.7888675623801, 683.0846665468272, 37458.250834983286, 38704.80647596765, 38792.03019924503, 38802.61197388025, 38806.41790373147, 39280.607193928125, 39826.80086599563, 40021.39967900484, 40179.397309040316, 40257.19485610286, 8439.451435656694, 8558.572071396406, 8565.828683426327, 8595.140485951386, 8622.180892815204, 8452.915470845275, 8640.2223799858, 8727.38908276421, 8784.29725621952, 8823.250023747989, 8737.257333126692, 8840.778980525507, 8886.955565222164, 8895.510746908918, 8895.95552022239, 8722.21500064994, 8741.606627701705, 8800.251978581828, 8807.383483156182, 8822.11778822119, 8353.457025293397, 8391.580420978988, 8460.365472589581, 8539.0, 8543.35924805642, 28307.292317692016, 39884.0, 40146.0, 40219.0, 40334.79832600818, 3176.2059485128716, 3332.8333583320737, 3377.2529149502907, 3390.423627983249, 3399.3711163434846, 29735.25661858449, 30014.298713115706, 30175.396492070035, 30617.846910765304, 31067.689323106933, 4283.293256612656, 4292.660614316831, 4343.956560434419, 4344.391785150082, 4350.195213885441, 252351.0, 259340.0, 260295.0, 260878.0, 341548.0, 34254.82872585621, 64651.35348646453, 65976.67011664911, 66068.66965665141, 66107.0, 37142.62857371446, 37188.25623487515, 37298.627013729514, 37513.62486375156, 37548.62451375506, 15194.468193613391, 15344.462943797136, 15399.0, 15418.229088545528, 15421.922890385476, 12641.2415255085, 12691.873081269254, 12696.682582935317, 12732.554360597334, 12757.617271481684, 8622.137786221328, 8674.956625216833, 8680.69617563395, 8795.824083518293, 8827.823443531222, 3351.4470112431663, 3396.1339858335964, 3421.418358878947, 3433.3305005523684, 3434.6737059979264, 1034.736142283728, 1047.2302857399804, 1068.6206396729206, 1069.0165048155716, 1087.6465148826662, 27610.723892761216, 27687.723122768515, 27786.3053423662, 27829.443411131662, 29801.10596682103, 1063.3301020357126, 1081.5241293830688, 1091.8034753744244, 1100.5982816272003, 1260.2249616485979, 15252.466163684217, 15445.922770386076, 15605.0, 15931.283092260875, 15976.440824571084, 473510.0, 479822.0, 479893.0, 482218.0, 483407.0, 57274.0, 58909.41090589039, 59018.70490647519, 59021.40978590159, 59120.40879591149, 1289.6324547503916, 1351.0407610596587, 1351.6350585341902, 1369.0, 1372.6499742565782, 29966.0, 30482.0, 30703.692963070083, 30709.24786435855, 31304.686953131088, 48931.510684892695, 49369.506304937924, 49488.25767613561, 49552.256716148564, 49619.25571116508, 340628.0, 345766.0, 346927.0, 347459.0, 348262.0, 28348.433031338845, 28899.277518061375, 28988.275293116996, 29012.27469313284, 29016.259024457755, 47172.528274718185, 47883.0, 48447.27329090137, 48483.27275090806, 49065.754671226416, 40405.12046687776, 40994.79502602468, 41143.0, 41791.7910410446, 42166.15667686691, 35996.64003359933, 36522.0, 36671.44992825163, 36789.0, 40552.79723601481, 35528.0, 35982.10044748902, 36384.09039773921, 37219.0, 37355.626443735215, 32292.67707322991, 34968.65031349654, 35200.47199292064, 35811.462828058124, 36374.0, 27328.72671273262, 27490.17529474119, 27495.0, 27540.586891196246, 27686.446271074063], "value": 18183.693733893004, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [387.41113507468646, 388.41349562161145, 390.99022524436896, 392.2222331172843, 399.22749479756675, 17908.64182716345, 18025.819741802577, 18416.631667366644, 18465.169067391947, 19828.0, 18273.634527309445, 18513.81486185141, 19016.524586885334, 19024.524386890334, 19044.428667139975, 5363.9463605363835, 5416.404195538487, 5613.859653508654, 5631.211630371751, 5640.746166422521, 5555.861103472405, 5587.552995760329, 5593.74828132735, 5608.691521966291, 5620.409856965021, 5341.679499230039, 5558.194061861028, 5565.0817615093465, 5595.916061259084, 5605.047141985872, 5502.944970550283, 5538.972305138469, 5544.16837474378, 5546.195801608744, 5585.804496842611, 4767.189577771787, 4817.060673168733, 4833.85498435044, 4852.175130227834, 4961.5286547777905, 22472.0, 22486.66270005951, 22507.0, 23270.76729232703, 23287.88356058209, 2214.833887458431, 2334.0780391745334, 2430.6961629796274, 2511.9120830770835, 2554.363497161258, 13564.796528052088, 14403.135811851322, 14468.855311446856, 14587.48943786973, 14651.267436628126, 1908.961820763577, 1974.2004488182165, 1981.5244341358114, 2048.6619707748205, 2059.4336557446823, 81222.59388703077, 81484.77772833413, 81890.59054704689, 82400.0, 82770.0, 9830.459324737209, 10060.0, 10217.795644087226, 10384.844227336596, 10431.94784026075, 13808.17150970945, 13921.721565568834, 14067.085639433404, 14083.929580352033, 14117.78823317651, 7975.361971042303, 8023.277904988579, 8074.757757267292, 8144.796380090426, 8180.918190818015, 8032.437729359006, 8113.269805717514, 8151.79620509492, 8264.462809917337, 8288.0, 6208.72060757267, 6285.622862628165, 6396.680165991682, 6404.231492220963, 6405.711742971577, 1833.8446778529442, 1845.593969326746, 1868.7664041994751, 1869.4017914267577, 1886.8962207078469, 982.5624873093831, 1004.6584161385164, 1019.6482213636284, 1097.9788796419407, 1156.9132315076404, 19316.420507384802, 19476.4157075288, 19478.0, 19499.61000780005, 19726.40820775379, 979.480875136179, 998.3161534348849, 1006.059334522224, 1024.7694268789462, 1046.199657262195, 10837.512311945982, 11131.72170695739, 11149.554017839358, 11245.437728113562, 11253.549858005588, 459470.0, 482475.0, 498582.0, 515552.0, 523569.0, 84138.57930710308, 86311.56844215738, 86786.0, 87354.0, 87371.0, 993.1558175550869, 1014.1227837920294, 1056.4031322302874, 1064.6646306413609, 1082.2045796339685, 16212.432564860173, 16441.67116657684, 16677.666446671243, 16930.49208523697, 17165.914170429067, 35772.64227357693, 40808.59191408167, 42190.1561968765, 43931.560684392745, 43941.0, 44544.0, 55338.0, 55483.72258138845, 55611.44388556063, 56024.719876400355, 6744.62904540255, 7756.146823849259, 8010.359171266401, 8274.710385136732, 8734.65061397537, 9604.807903842024, 12395.0, 13276.867231327564, 13310.401031953392, 13475.124116932368, 11427.0, 11556.364399957747, 11597.246178998337, 11835.467403967014, 12377.566785162477, 6633.734650614115, 10427.478626068514, 11405.258658187191, 12110.0, 12245.081618878441, 12432.75134497323, 12578.496860125859, 12580.245185288912, 12594.87405125937, 12881.871181288067, 8511.74464766058, 8569.357298202784, 8586.527740974307, 8621.956890215508, 8705.085965973482, 12203.450844711831, 12253.571125010581, 12256.080793940311, 12308.507659693512, 12368.876311237133], "value": 9228.241912971647, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1532.770084487327, 1559.2515592515592, 1698.957526061849, 1776.3782676063372, 1839.025316582211, 7477.551346919188, 7872.606369681522, 8010.439269251155, 8354.624041918112, 8425.662973481054, 7990.161033091515, 8087.555184464852, 8096.919030809705, 8106.635201415936, 8145.104038555754, 2189.135291559829, 2215.7784221577876, 2226.4100013496436, 2230.174835310929, 2231.739067426907, 2187.4312678703573, 2212.325240801555, 2214.2914267434426, 2229.342344008521, 2229.5429436965383, 2227.3095340444434, 2228.7882651148116, 2232.1294695068937, 2248.7413947396094, 2259.039908039085, 2173.3262688566438, 2195.8133558647532, 2197.626403511399, 2199.1753092590357, 2202.922897698581, 2174.706414634036, 2174.923877664274, 2180.9781902180935, 2182.334388011656, 2193.100828660242, 8212.137725538792, 8248.092709801916, 8282.627281772335, 8284.585770711441, 8320.417570770049, 4700.741459219742, 4859.2954021666665, 4864.902701945941, 4886.096072226649, 4892.168331383673, 2993.9401211975637, 3166.794158379698, 3174.6507884132725, 3175.1744546417867, 3185.697358750915, 971.4220039076738, 976.858355538443, 993.4138858073699, 1028.5577201803221, 1036.6889933020138, 11187.608433704863, 11266.887331126665, 11288.774224515546, 11317.773644527064, 11370.602028928948, 4244.72409293395, 4332.1119170569955, 4392.4289842320295, 4395.208862404797, 4418.116376724668, 9851.261155413373, 9852.80294394108, 9871.160951319218, 9896.25778066648, 9910.454924979196, 4993.375828021497, 5048.217526283432, 5131.2559678846355, 5143.485651434827, 5147.176451767774, 4036.0, 4529.433820772403, 4619.514950930171, 4639.86080417588, 4682.4381074271305, 3729.4405839123806, 3890.688744900401, 3890.9416358754643, 3911.6088391160656, 3915.530136383652, 1227.8281040654315, 1251.9123661343801, 1257.478146569182, 1261.2999785119164, 1276.9720375098136, 993.2401712689798, 995.5221493682928, 1000.8949060348705, 1009.8889122196553, 1012.549415510091, 5613.831585052455, 5676.233708449389, 5728.54171666274, 5755.050416681201, 5916.668749531407, 965.9372140810825, 975.9365641233439, 998.7353351361895, 1011.716719318592, 1040.2822052783556, 3915.197384536163, 3939.074317535377, 3940.0346915006007, 3974.8608798692485, 3977.6134319408125, 9634.229261659051, 10052.0, 10071.597136114473, 10106.797864042825, 10164.186865050779, 9940.353876997971, 10192.796144077225, 10198.694039178836, 10201.99999999985, 10210.795784084277, 7709.267619576131, 7851.136374998746, 7883.329916957008, 7901.486403383762, 7939.0, 5459.262999495176, 5569.944300557105, 5647.0, 5655.85860353478, 5669.34802497718, 9210.631574737203, 9277.953610231905, 9487.810243794947, 9556.90443095588, 9611.279154063614, 9382.859257111013, 9699.854502182332, 9759.756006099904, 9898.851517227104, 10027.0, 7341.192468828318, 7423.925760742323, 7650.8087297818, 7653.234676532302, 7688.038995125609, 8014.679412823421, 8090.919090809017, 8135.877961830695, 8136.308413784658, 8140.104588495143, 7104.325089116525, 7239.095113110861, 7401.259874012556, 7504.62476876165, 7614.657340419583, 7188.28117188277, 7194.532355396883, 7242.02232698579, 7266.636668166465, 7391.2239214881665, 6705.591825716654, 6735.6295403753265, 6735.932640673726, 6766.05275261454, 6778.389944904982, 4980.975095124501, 5016.347874776402, 5062.683702237518, 5158.509941555546, 5204.453532379197, 5156.871078223075, 5238.214267859851, 5262.789488420573, 5288.497592728685, 5299.284596579567], "value": 4447.690823817999, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [319.10172863389545, 324.8343344894104, 326.9133679574913, 327.8655751142031, 332.6191510720227, 5406.91889621656, 5408.567314614831, 5464.781408743651, 5594.608377413582, 5632.01439748044, 5464.12573988162, 5491.560675145989, 5516.91724624131, 5539.446055394458, 5540.030494663438, 4261.509926358477, 4288.592583704543, 4308.482982042159, 4308.870733877989, 4310.956890431103, 4222.074137433734, 4336.436263285768, 4343.6959412841115, 4347.956490442287, 4351.151525452538, 4230.344296634026, 4283.357496375553, 4289.077848262623, 4303.526612072669, 4315.892102697427, 4279.957200427987, 4285.571442855705, 4301.6343610792965, 4324.005478739876, 4337.327714204272, 3635.654612811779, 3800.9167387294488, 3807.1814559869763, 3811.942820857689, 3819.9045023874346, 5215.817446389358, 5263.763130659091, 5280.973595132038, 5292.41227631709, 5333.546648534879, 4818.301346304801, 4843.055604157191, 4853.733044682541, 4856.68431551948, 4857.0814528261135, 5603.7478313475995, 5685.943140568583, 5696.943030569682, 5701.230333904953, 5755.625884317506, 4113.25961326961, 4131.710780245384, 4141.378793181017, 4141.503019637663, 4153.878452817752, 5930.347661757203, 6017.06735456005, 6020.789272375446, 6073.362296958844, 6107.603005804653, 4107.54816970133, 4169.10364271683, 4172.290710579148, 4183.518895327076, 4209.768462734579, 4235.407043013919, 4251.128518653669, 4255.702100852911, 4264.637505812041, 4274.294741367702, 4822.276658501253, 4851.708897466164, 4854.732989685601, 4857.878553036202, 4875.561199492063, 5592.860178495489, 5813.011787995966, 5863.413658634103, 5876.059830427112, 5904.143899134601, 1533.072491142865, 1549.6590750034975, 1549.9535013949373, 1554.168519841879, 1562.8671562917052, 1016.425719468498, 1031.7575369788094, 1033.547865249326, 1040.8178568750438, 1042.3641578637025, 6084.026555751058, 6085.36103709113, 6097.17688112108, 6135.570510064342, 6143.784967526115, 6342.0, 6360.840978975562, 6367.395097465734, 6393.529488217643, 6435.935640643627, 5985.880282394415, 6032.125341825498, 6062.575619706578, 6079.392060793885, 6094.725737341831, 3386.390449719025, 3393.830308484566, 3412.112850658797, 3418.9487157692656, 3425.4861770734587, 6483.384078512534, 6573.276939536647, 6575.704093315812, 6600.471962243009, 6664.03410993758, 6457.1282876811965, 6460.3862633049785, 6489.3510648934725, 6534.771283005072, 6538.248101468297, 6449.355064493513, 6512.674366281667, 6574.474042076622, 6583.572067815577, 6620.5765760361755, 6386.393292637192, 6392.264889537762, 6395.744170233324, 6413.16628838248, 6431.1317972073175, 6064.696765161812, 6298.433141017331, 6316.147320111726, 6338.746450141943, 6369.49044076482, 5858.2677165354335, 6539.247986481616, 6592.505562082767, 6624.8343791405605, 6630.801075967729, 4095.9760059985006, 4276.0, 4289.0, 4304.4834619845815, 4308.289132293136, 5910.615809972338, 5961.225040744675, 5969.761209551743, 5973.402659733992, 6049.759799241057, 5649.774009039593, 5750.166225897305, 5756.366799651951, 5782.421757824184, 5804.970975145097, 5695.45893140151, 5774.249347584787, 5790.826275211751, 5805.332386775406, 5806.0, 5646.322441307069, 5651.858703532444, 5679.484809576479, 5681.147827825859, 5686.34607020198, 5572.637778544382, 5764.769409223584, 5827.70861456917, 5828.708564571839, 5828.901595425728, 5609.467100625434, 5617.8033768817895, 5632.971835140798, 5657.32112146545, 5670.518005969374], "value": 4503.680133210739, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [694.2710154337946, 806.7579726082178, 812.2121542104164, 817.7873752824264, 819.6311659753112, 12603.117781755269, 13153.802692959602, 13211.537596184147, 13309.80035299469, 13313.201207927532, 11970.461329240183, 12012.45943932523, 12026.639200823967, 12027.458764355602, 12066.577669781538, 661.8312330355752, 787.6967367563471, 790.8378782349619, 811.4968719393984, 815.2784785464877, 808.9878651820227, 810.5582457560614, 813.4265342933218, 813.6704634622987, 814.287498438866, 844.957752112395, 846.5090247656344, 852.86780549015, 855.1320409784043, 859.0593300336122, 839.6347588798861, 845.5011543189516, 846.2764336492272, 848.758103940374, 849.2569002123142, 623.6756886419082, 626.7242413338116, 628.9245290565116, 629.2637613991641, 630.6373835044867, 11951.984081353008, 12048.156629035971, 12074.577389791402, 12086.670466248706, 12145.939270303681, 13686.931565342109, 14098.0, 14180.14919104857, 14198.645033874132, 14253.50112746049, 10887.618933337295, 10965.61620343284, 11106.333619982826, 11239.100871930308, 11455.541778328858, 3781.1681430085337, 3886.125621735115, 3947.842086316544, 3951.7628942263555, 4044.029432936074, 53919.73040134774, 54122.45877541214, 54943.17585236225, 55315.72342138264, 55396.446035539935, 10954.287971281841, 10992.835107473395, 11025.257519366742, 11074.889251107386, 11125.388103654215, 20443.795562044488, 20458.38624841257, 20573.79426205719, 20629.0, 20634.79365206359, 8367.58162091905, 8414.873776893352, 8503.872441913376, 8508.617112229964, 8554.743357699279, 4593.54064593538, 4669.906601867943, 4697.95302046982, 4699.989502257031, 4765.642576806753, 3429.742769292313, 3435.158386195348, 3460.0657822388316, 3472.8958131256104, 3488.4418493040994, 608.330836080317, 609.4332270987935, 617.7251123250201, 626.7148447456397, 627.7802769030802, 504.44511037858064, 564.2354609504144, 582.0715958046908, 587.7325816753367, 609.7225762278152, 8717.738467845975, 8980.506072166094, 8983.46099234048, 9025.864612030824, 9065.682701105561, 619.553921176752, 620.3703241210176, 662.3872917551342, 678.3928384096305, 735.1766022055225, 4069.918601627951, 4156.106437116035, 4157.542670306264, 4159.230542349675, 4194.6853985951175, 64999.35000650027, 65422.672886635264, 65473.34526654768, 65720.67139664367, 66913.0, 53318.466815332125, 53390.19914701283, 53676.0, 54142.0, 55148.0, 50503.74748126309, 50736.49263507391, 51146.48853511417, 51429.742851285504, 51448.74275628598, 7623.618819058914, 7902.209779022051, 7943.086545047162, 7955.1249362571225, 8077.959610201911, 31377.529337059506, 32712.672873270963, 32864.67135328616, 33182.83408582942, 33898.152546186546, 46422.7678861617, 47285.52714472811, 47472.0, 47762.28356574724, 47783.761081194374, 11320.660380188607, 11325.263857849213, 11345.546178152781, 11581.942090289494, 11844.407779611158, 12018.459169337575, 12611.43248553799, 12705.936470317589, 13579.0, 13854.792178117135, 11993.820092698443, 12103.092268079754, 12205.633830985085, 12308.569200077955, 12565.246085234916, 12503.4373453193, 12665.176763510342, 12713.491460341484, 12742.0, 12830.166039207796, 10640.787184256425, 11536.307821530734, 11930.463129159381, 12015.519379225083, 12040.277583345027, 10174.8473772892, 10549.314294570828, 10836.295640783324, 10969.561217551209, 10978.780424391627, 10578.841317380091, 10721.731956701145, 10722.839157412489, 10808.56765729362, 11024.228304018641], "value": 6569.029201112509, "unit": "score"}], "name": "dromaeo_css", "value": 6993.999355644369, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 107.0, 115.0, 112.0, 113.0, 124.0, 113.0, 112.0, 112.0, 111.0], "value": 113.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 135.0, 153.0, 184.0, 132.0, 156.0, 157.0, 131.0, 203.0, 130.0], "value": 154.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 161.0, 162.0, 159.0, 166.0, 175.0, 165.0, 166.0, 162.0], "value": 164.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 80.0, 80.0, 166.0, 78.0, 79.0, 76.0, 79.0, 168.0, 79.0], "value": 96.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 93.0, 142.0, 92.0, 95.0, 94.0, 146.0, 93.0, 93.0, 145.0], "value": 108.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 118.0, 117.0, 118.0, 117.0, 117.0, 118.0, 118.0], "value": 117.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 145.0, 146.0, 146.0, 147.0, 147.0, 146.0, 146.0, 146.0, 148.0], "value": 146.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 100.0, 95.0, 96.0, 94.0, 95.0, 95.0, 96.0, 95.0, 96.0], "value": 95.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 58.0, 57.0, 59.0, 58.0, 58.0, 58.0, 78.0, 57.0, 55.0], "value": 59.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 64.0, 67.0, 64.0, 63.0, 63.0, 63.0, 63.0, 63.0, 63.0], "value": 63.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 85.0, 78.0, 81.0, 80.0, 80.0, 84.0, 83.0, 83.0, 80.0], "value": 81.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 128.0, 136.0, 126.0, 126.0, 123.0, 135.0, 125.0, 162.0, 128.0], "value": 132.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 171.0, 179.0, 169.0, 181.0, 181.0, 172.0, 171.0, 175.0, 171.0], "value": 174.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 71.0, 70.0, 73.0, 73.0, 70.0, 69.0, 75.0, 70.0, 70.0], "value": 71.0, "unit": "score"}], "name": "kraken", "value": 1577.6, "alertThreshold": 2.0}]} 05:41:01 INFO - Return code: 0 05:41:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 05:41:01 ERROR - # TBPL SUCCESS # 05:41:01 INFO - Running post-action listener: _resource_record_post_action 05:41:01 INFO - Running post-run listener: _resource_record_post_run 05:41:02 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 4096; Write bytes: 359419904; Read time: 20; Write time: 240124 05:41:02 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 72708096; Read time: 0; Write time: 55840 05:41:02 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 4096; Write bytes: 286711808; Read time: 20; Write time: 184284 05:41:02 INFO - Running post-run listener: _upload_blobber_files 05:41:02 INFO - Blob upload gear active. 05:41:02 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:41:02 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 05:41:02 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'] 05:41:02 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 05:41:02 INFO - (blobuploader) - INFO - Open directory for files ... 05:41:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:41:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:41:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:41:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:41:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:41:03 INFO - (blobuploader) - INFO - Done attempting. 05:41:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 05:41:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:41:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:41:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 05:41:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:41:04 INFO - (blobuploader) - INFO - Done attempting. 05:41:04 INFO - (blobuploader) - INFO - Iteration through files over. 05:41:04 INFO - Return code: 0 05:41:04 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:41:04 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:41:04 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b7620dc095af0481ed5f5c8563447d63650dc0b878b2b8846aeb159dcd1510de3838dca6dc217ad6bdded635776fa9d42f5403d7d2aeaeeac1bb3777eb445ac2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a988dff10d2c355ccddefeef83f50fd5366b8f969538dd7feb2d818c795d8550274fc6e711077049e33009960132570c200030bc7d8eb2ed8c52e6e065b05617"} 05:41:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:41:04 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:41:04 INFO - Contents: 05:41:04 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b7620dc095af0481ed5f5c8563447d63650dc0b878b2b8846aeb159dcd1510de3838dca6dc217ad6bdded635776fa9d42f5403d7d2aeaeeac1bb3777eb445ac2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a988dff10d2c355ccddefeef83f50fd5366b8f969538dd7feb2d818c795d8550274fc6e711077049e33009960132570c200030bc7d8eb2ed8c52e6e065b05617"} 05:41:04 INFO - Running post-run listener: copy_logs_to_upload_dir 05:41:04 INFO - Copying logs to upload dir... 05:41:04 INFO - mkdir: /builds/slave/test/build/upload/logs 05:41:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=2121.484887 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 35 mins, 21 secs) (at 2016-05-02 05:41:04.652188) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-02 05:41:04.655420) ========= 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=a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700 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/b7620dc095af0481ed5f5c8563447d63650dc0b878b2b8846aeb159dcd1510de3838dca6dc217ad6bdded635776fa9d42f5403d7d2aeaeeac1bb3777eb445ac2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a988dff10d2c355ccddefeef83f50fd5366b8f969538dd7feb2d818c795d8550274fc6e711077049e33009960132570c200030bc7d8eb2ed8c52e6e065b05617"} build_url:https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011483 build_url: 'https://queue.taskcluster.net/v1/task/dmK0WEFBQbiCC3WwNLifhw/artifacts/public/build/firefox-49.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/b7620dc095af0481ed5f5c8563447d63650dc0b878b2b8846aeb159dcd1510de3838dca6dc217ad6bdded635776fa9d42f5403d7d2aeaeeac1bb3777eb445ac2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a988dff10d2c355ccddefeef83f50fd5366b8f969538dd7feb2d818c795d8550274fc6e711077049e33009960132570c200030bc7d8eb2ed8c52e6e065b05617"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-02 05:41:04.679901) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-02 05:41:04.680199) ========= 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=a0d2d2de893abaa8702a9954000001a7-1462189099.520891-901128700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004494 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-02 05:41:04.764955) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-02 05:41:04.765684) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-02 05:41:04.766368) ========= ========= Total master_lag: 0.16 =========